[10:53:07.411] <TB0> INFO: *** Welcome to pxar ***
[10:53:07.411] <TB0> INFO: *** Today: 2016/11/09
[10:53:07.545] <TB0> INFO: *** Version: c8ba-dirty
[10:53:07.545] <TB0> INFO: readRocDacs: /Users/danek_kotlinski/danek/public/PHASE1/OnShellTest/results_L3plus/M3242_OnShellQuickTest_2016-11-09_10h52m_1478685163//000_OnShellQuickTest_p17//dacParameters_C0.dat .. /Users/danek_kotlinski/danek/public/PHASE1/OnShellTest/results_L3plus/M3242_OnShellQuickTest_2016-11-09_10h52m_1478685163//000_OnShellQuickTest_p17//dacParameters_C15.dat
[10:53:07.662] <TB0> INFO: readTbmDacs: /Users/danek_kotlinski/danek/public/PHASE1/OnShellTest/results_L3plus/M3242_OnShellQuickTest_2016-11-09_10h52m_1478685163//000_OnShellQuickTest_p17//tbmParameters_C0a.dat .. /Users/danek_kotlinski/danek/public/PHASE1/OnShellTest/results_L3plus/M3242_OnShellQuickTest_2016-11-09_10h52m_1478685163//000_OnShellQuickTest_p17//tbmParameters_C0b.dat
[10:53:07.664] <TB0> INFO: readMaskFile: /Users/danek_kotlinski/danek/public/PHASE1/OnShellTest/results_L3plus/M3242_OnShellQuickTest_2016-11-09_10h52m_1478685163//000_OnShellQuickTest_p17//defaultMaskFile.dat
[10:53:07.666] <TB0> INFO: readTrimFile: /Users/danek_kotlinski/danek/public/PHASE1/OnShellTest/results_L3plus/M3242_OnShellQuickTest_2016-11-09_10h52m_1478685163//000_OnShellQuickTest_p17//trimParameters_C0.dat .. /Users/danek_kotlinski/danek/public/PHASE1/OnShellTest/results_L3plus/M3242_OnShellQuickTest_2016-11-09_10h52m_1478685163//000_OnShellQuickTest_p17//trimParameters_C15.dat
[10:53:07.770] <TB0> INFO: clk: 4
[10:53:07.770] <TB0> INFO: ctr: 4
[10:53:07.770] <TB0> INFO: sda: 19
[10:53:07.770] <TB0> INFO: tin: 9
[10:53:07.770] <TB0> INFO: level: 15
[10:53:07.770] <TB0> INFO: triggerdelay: 0
[10:53:07.771] <TB0> QUIET: Instanciating API for pxar v1.8.0+1259~g87a54fa
[10:53:07.771] <TB0> INFO: Log level: INFO
[10:53:07.901] <TB0> QUIET: Connection to board DTB_WS6THK opened.
[10:53:07.903] <TB0> INFO: DTB startup information
--- DTB info------------------------------------------
Board id: 81
HW version: DTB1.2
FW version: 4.6
SW version: 4.7
Options: LCDS2
USB id: DTB_WS6THK
MAC address: 40D855118051
Hostname: pixelDTB081
Comment:
------------------------------------------------------
[10:53:07.906] <TB0> INFO: RPC call hashes of host and DTB match: 486171790
[10:53:09.699] <TB0> INFO: DUT info:
[10:53:09.699] <TB0> INFO: The DUT currently contains the following objects:
[10:53:09.699] <TB0> INFO: 2 TBM Cores tbm08c (2 ON)
[10:53:09.699] <TB0> INFO: TBM Core alpha (0): 7 registers set
[10:53:09.699] <TB0> INFO: TBM Core beta (1): 7 registers set
[10:53:09.699] <TB0> INFO: 16 ROCs psi46digv21respin (16 ON) with 4160 pixelConfigs
[10:53:09.699] <TB0> INFO: ROC 0: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 1: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 2: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 3: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 4: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 5: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 6: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 7: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 8: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 9: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 10: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 11: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 12: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 13: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 14: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:09.699] <TB0> INFO: ROC 15: 19 DACs set, Pixels: 0 masked, 0 active.
[10:53:10.109] <TB0> INFO: enter 'restricted' command line mode
[10:53:10.109] <TB0> INFO: enter test to run
[10:53:10.109] <TB0> INFO: test: OnShellQuickTest no parameter change
[10:53:10.109] <TB0> INFO: running: onshellquicktest
[10:53:11.026] <TB0> INFO: ######################################################################
[10:53:11.026] <TB0> INFO: PixTestOnShellQuickTest::doTest()
[10:53:11.027] <TB0> INFO: ######################################################################
[10:53:11.027] <TB0> INFO: ----------------------------------------------------------------------
[10:53:11.027] <TB0> INFO: PixTestOnShellQuickTest::signalTest()
[10:53:11.027] <TB0> INFO: ----------------------------------------------------------------------
[10:53:11.027] <TB0> INFO: PixTestCmd::init()
[10:53:11.906] <TB0> WARNING: Pattern generator does not contain a trigger signal. No data is expected from the DUT!
[10:53:13.445] <TB0> WARNING: Pattern generator does not contain a trigger signal. No data is expected from the DUT!
[10:53:13.829] <TB0> WARNING: Pattern generator does not contain a trigger signal. No data is expected from the DUT!
[10:53:14.225] <TB0> INFO: clk low = -205.0 mV high= 192.0 mV amplitude = 397.0 mVpp (differential)
[10:53:14.225] <TB0> INFO: ctr low = -237.0 mV high= 225.0 mV amplitude = 462.0 mVpp (differential)
[10:53:14.225] <TB0> INFO: sda low = -241.0 mV high= 225.0 mV amplitude = 466.0 mVpp (differential)
[10:53:14.225] <TB0> INFO: rda low = -66.0 mV high= 58.0 mV amplitude = 124.0 mVpp (differential)
[10:53:14.225] <TB0> INFO: sdata1 low = -107.0 mV high= 94.0 mV amplitude = 201.0 mVpp (differential)
[10:53:14.225] <TB0> INFO: sdata2 low = -11.0 mV high= -7.0 mV amplitude = 4.0 mVpp (differential)
[10:53:15.702] <TB0> INFO: ----------------------------------------------------------------------
[10:53:15.702] <TB0> INFO: PixTestOnShellQuickTest::programROC()
[10:53:15.702] <TB0> INFO: ----------------------------------------------------------------------
[10:53:33.829] <TB0> INFO: PixTestOnShellQuickTest::programROC() done: ROCs are all programmable
[10:53:33.829] <TB0> INFO: IA differences per ROC: 19.3 20.9 20.1 20.1 19.3 20.9 21.7 22.5 20.9 20.9 20.1 19.3 19.3 20.1 20.1 20.1
[10:53:33.879] <TB0> INFO: ----------------------------------------------------------------------
[10:53:33.879] <TB0> INFO: PixTestOnShellQuickTest::setVana() target Ia = 24 mA/ROC
[10:53:33.879] <TB0> INFO: ----------------------------------------------------------------------
[10:53:45.380] <TB0> INFO: PixTestOnShellQuickTest::setVana() done, Module Ia 385.1 mA = 24.0688 mA/ROC
[10:53:45.380] <TB0> INFO: i(loss) [mA/ROC]: 19.3 19.3 19.3 19.3 18.5 20.1 18.5 18.5 18.5 18.5 19.3 18.5 18.5 17.7 19.3 19.3
[10:53:45.531] <TB0> INFO: ----------------------------------------------------------------------
[10:53:45.531] <TB0> INFO: PixTestOnShellQuickTest::findTiming()
[10:53:45.531] <TB0> INFO: ----------------------------------------------------------------------
[10:53:45.531] <TB0> INFO: Testing Timing: Attempt #1
[10:53:47.162] <TB0> INFO: NErrors = 0
[10:53:47.162] <TB0> INFO: NEvents = 10000
[10:53:47.292] <TB0> INFO: Timings are already good, no scan needed!
[10:53:47.443] <TB0> INFO: ----------------------------------------------------------------------
[10:53:47.443] <TB0> INFO: PixTestOnShellQuickTest::findWorkingPixel()
[10:53:47.443] <TB0> INFO: ----------------------------------------------------------------------
[10:53:47.543] <TB0> INFO: Expecting 231680 events.
[10:53:55.606] <TB0> INFO: 231680 events read in total (7507ms).
[10:53:55.634] <TB0> INFO: Test took 8183ms.
[10:53:55.891] <TB0> INFO: Found working pixel in all ROCs: col/row = 12/22
[10:53:56.021] <TB0> INFO: ----------------------------------------------------------------------
[10:53:56.021] <TB0> INFO: PixTestOnShellQuickTest::setVthrCompCalDel()
[10:53:56.021] <TB0> INFO: ----------------------------------------------------------------------
[10:53:56.031] <TB0> INFO: /1
[10:53:56.036] <TB0> INFO: /2
[10:53:56.124] <TB0> INFO: Expecting 463360 events.
[10:54:08.280] <TB0> INFO: 463360 events read in total (11600ms).
[10:54:08.300] <TB0> INFO: Test took 12263ms.
[10:54:08.329] <TB0> INFO: /3
[10:54:08.631] <TB0> INFO: PixTestOnShellQuickTest::setVthrCompCalDel() done
[10:54:08.631] <TB0> INFO: CalDel: 127 99 121 103 119 127 138 125 118 115 115 122 141 99 119 148
[10:54:08.631] <TB0> INFO: VthrComp: 54 51 51 51 51 51 51 52 51 51 53 51 51 54 53 52
[10:54:08.634] <TB0> INFO: ----------------------------------------------------------------------
[10:54:08.634] <TB0> INFO: PixTestOnShellQuickTest::hvQuickTest()
[10:54:08.634] <TB0> INFO: ----------------------------------------------------------------------
[10:54:09.476] <TB0> INFO: Expecting 41600 events.
[10:54:13.268] <TB0> INFO: 41600 events read in total (3236ms).
[10:54:13.270] <TB0> INFO: Test took 4222ms.
[10:54:13.878] <TB0> INFO: Expecting 41600 events.
[10:54:17.680] <TB0> INFO: 41600 events read in total (3246ms).
[10:54:17.683] <TB0> INFO: Test took 4217ms.
[10:54:18.109] <TB0> INFO: Inefficient pixels per ROC: 0 0 0 3 0 0 0 0 0 0 5 1 0 7 3 14
[10:54:18.109] <TB0> INFO: Delta Pixel Alive with HV per ROC: 145 17 10 21 3 15 3 116 75 4 53 6 24 78 47 91
[10:54:18.112] <TB0> INFO: Database: Dead Pixels
[10:54:18.112] <TB0> INFO: Dead pixels per ROC: 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[10:54:18.112] <TB0> INFO: Quicktest: Dead Pixels
[10:54:18.112] <TB0> INFO: Dead pixels per ROC: 0 0 0 3 0 0 0 0 0 0 5 1 0 7 3 14
[10:54:18.176] <TB0> INFO: ----------------------------------------------------------------------
[10:54:18.176] <TB0> INFO: PixTestOnShellQuickTest::bbQuickTest()
[10:54:18.176] <TB0> INFO: ----------------------------------------------------------------------
[10:54:18.176] <TB0> INFO: using Ntrig = 10, Vthrcomp = 105, fParVcalS = 250
[10:54:18.575] <TB0> INFO: Expecting 41600 events.
[10:54:22.349] <TB0> INFO: 41600 events read in total (3218ms).
[10:54:22.352] <TB0> INFO: Test took 4170ms.
[10:54:22.378] <TB0> INFO: using Vana from file:
[10:54:22.378] <TB0> INFO: Vana:88 82 92 79 80 88 90 78 85 83 78 75 79 88 85 82
[10:54:22.382] <TB0> INFO: using Vthrcomps from file:
[10:54:22.382] <TB0> INFO: Vthrcomp:94 94 87 85 96 101 92 93 84 91 69 94 84 91 96 80
[10:54:22.802] <TB0> INFO: Expecting 41600 events.
[10:54:26.819] <TB0> INFO: 41600 events read in total (3460ms).
[10:54:26.824] <TB0> INFO: Test took 4430ms.
[10:54:27.019] <TB0> INFO: results from database:
[10:54:27.019] <TB0> INFO: Dead bumps per ROC: 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[10:54:27.019] <TB0> INFO: quicktest:
[10:54:27.019] <TB0> INFO: Dead bumps per ROC: 0 0 0 1 12 0 0 0 0 0 0 1 0 0 0 0
[10:54:27.115] <TB0> INFO: ######################################################################
[10:54:27.115] <TB0> INFO: PixTestBB2Map::doTest() Ntrig = 2, VcalS = 222, PlWidth = 35
[10:54:27.115] <TB0> INFO: ######################################################################
[10:54:27.116] <TB0> INFO: ----------------------------------------------------------------------
[10:54:27.116] <TB0> INFO: PixTestBB2Map::setVana() target Ia = 24 mA/ROC
[10:54:27.116] <TB0> INFO: ----------------------------------------------------------------------
[10:54:32.115] <TB0> INFO: PixTestBB2Map::setVana() done, Module Ia 387.5 mA = 24.2188 mA/ROC
[10:54:32.116] <TB0> INFO: ----------------------------------------------------------------------
[10:54:32.116] <TB0> INFO: PixTestBB2Map::setVthrCompCalDel()
[10:54:32.116] <TB0> INFO: ----------------------------------------------------------------------
[10:54:32.213] <TB0> INFO: Expecting 131072 events.
[10:54:39.914] <TB0> INFO: 131072 events read in total (7143ms).
[10:54:39.951] <TB0> INFO: Test took 7825ms.
[10:54:40.255] <TB0> INFO: PixTestBB2Map::setVthrCompCalDel() done
[10:54:40.255] <TB0> INFO: CalDel: 128 102 118 103 112 125 130 125 118 109 115 120 136 100 113 146
[10:54:40.255] <TB0> INFO: VthrComp: 75 78 68 65 54 73 58 73 71 64 70 66 70 84 72 65
[10:54:40.727] <TB0> INFO: Expecting 1064960 events.
[10:55:27.364] <TB0> INFO: 1064960 events read in total (46081ms).
[10:55:27.544] <TB0> INFO: Test took 47238ms.
[10:55:28.927] <TB0> INFO: Missing Bumps: 0 0 0 3 0 0 0 0 0 0 0 0 0 0 0 2
[10:55:28.927] <TB0> INFO: Separation Cut: 45.00 45.00 45.00 45.00 45.00 45.00 45.00 45.00 45.00 45.00 45.00 45.00 40.71 45.00 45.00 43.34
[10:55:28.927] <TB0> INFO: PixTestBB2Map::doTest() done,61 seconds
[10:55:30.499] <TB0> INFO: PixTestOnShellQuickTest::doTest() done, duration: 140 seconds
[10:55:30.821] <TB0> INFO: enter test to run
[10:55:30.821] <TB0> INFO: test: no parameter change
[10:55:30.856] <TB0> QUIET: Connection to board 81 closed.
[10:55:31.482] <TB0> INFO: pXar: this is the end, my friend