Test Date: 2016-05-03 21:58
Analysis date: 2016-05-26 16:35
Logfile
LogfileView
[23:26:08.246] <TB2> INFO: *** Welcome to pxar ***
[23:26:08.246] <TB2> INFO: *** Today: 2016/05/03
[23:26:08.354] <TB2> INFO: *** Version: 9751-dirty
[23:26:08.354] <TB2> INFO: readRocDacs: /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C0.dat .. /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C15.dat
[23:26:08.356] <TB2> INFO: readTbmDacs: /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//tbmParameters_C0a.dat .. /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//tbmParameters_C0b.dat
[23:26:08.356] <TB2> INFO: readMaskFile: /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//defaultMaskFile.dat
[23:26:08.356] <TB2> INFO: readTrimFile: /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters_C0.dat .. /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters_C15.dat
[23:26:08.435] <TB2> INFO: clk: 4
[23:26:08.435] <TB2> INFO: ctr: 4
[23:26:08.435] <TB2> INFO: sda: 19
[23:26:08.435] <TB2> INFO: tin: 9
[23:26:08.435] <TB2> INFO: level: 15
[23:26:08.435] <TB2> INFO: triggerdelay: 0
[23:26:08.435] <TB2> QUIET: Instanciating API for pxar v2.7.5+16~g4df2ad8
[23:26:08.435] <TB2> INFO: Log level: INFO
[23:26:08.442] <TB2> INFO: Found DTB DTB_WXC55Z
[23:26:08.452] <TB2> QUIET: Connection to board DTB_WXC55Z opened.
[23:26:08.453] <TB2> INFO: DTB startup information
--- DTB info------------------------------------------
Board id: 156
HW version: DTB1.2
FW version: 4.4
SW version: 4.6
Options:
USB id: DTB_WXC55Z
MAC address: 40D85511809C
Hostname: pixelDTB156
Comment:
------------------------------------------------------
[23:26:08.455] <TB2> INFO: RPC call hashes of host and DTB match: 484264910
[23:26:09.997] <TB2> INFO: DUT info:
[23:26:09.997] <TB2> INFO: The DUT currently contains the following objects:
[23:26:09.997] <TB2> INFO: 2 TBM Cores tbm09c (2 ON)
[23:26:09.997] <TB2> INFO: TBM Core alpha (0): 7 registers set
[23:26:09.997] <TB2> INFO: TBM Core beta (1): 7 registers set
[23:26:09.997] <TB2> INFO: 16 ROCs psi46digv21respin (16 ON) with 4160 pixelConfigs
[23:26:09.997] <TB2> INFO: ROC 0: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.997] <TB2> INFO: ROC 1: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.997] <TB2> INFO: ROC 2: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.997] <TB2> INFO: ROC 3: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.997] <TB2> INFO: ROC 4: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.997] <TB2> INFO: ROC 5: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.997] <TB2> INFO: ROC 6: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.998] <TB2> INFO: ROC 7: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.998] <TB2> INFO: ROC 8: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.998] <TB2> INFO: ROC 9: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.998] <TB2> INFO: ROC 10: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.998] <TB2> INFO: ROC 11: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.998] <TB2> INFO: ROC 12: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.998] <TB2> INFO: ROC 13: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.998] <TB2> INFO: ROC 14: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:09.998] <TB2> INFO: ROC 15: 19 DACs set, Pixels: 0 masked, 0 active.
[23:26:10.399] <TB2> INFO: enter 'restricted' command line mode
[23:26:10.399] <TB2> INFO: enter test to run
[23:26:10.399] <TB2> INFO: test: pretest no parameter change
[23:26:10.399] <TB2> INFO: running: pretest
[23:26:10.404] <TB2> INFO: ----------------------------------------------------------------------
[23:26:10.404] <TB2> INFO: PixTestPretest::programROC()
[23:26:10.404] <TB2> INFO: ----------------------------------------------------------------------
[23:26:28.419] <TB2> INFO: PixTestPretest::programROC() done: ROCs are all programmable
[23:26:28.419] <TB2> INFO: IA differences per ROC: 19.3 20.9 17.7 20.9 19.3 20.1 17.7 20.1 17.7 17.7 17.7 16.9 22.5 20.9 20.9 17.7
[23:26:28.509] <TB2> INFO: enter test to run
[23:26:28.509] <TB2> INFO: test: pretest no parameter change
[23:26:28.509] <TB2> INFO: running: pretest
[23:26:28.510] <TB2> INFO: ----------------------------------------------------------------------
[23:26:28.510] <TB2> INFO: PixTestPretest::setVana() target Ia = 24 mA/ROC
[23:26:28.510] <TB2> INFO: ----------------------------------------------------------------------
[23:26:49.791] <TB2> INFO: PixTestPretest::setVana() done, Module Ia 389.1 mA = 24.3188 mA/ROC
[23:26:49.791] <TB2> INFO: i(loss) [mA/ROC]: 18.5 20.1 19.3 18.5 20.1 19.3 19.3 19.3 19.3 19.3 18.5 18.5 19.3 19.3 19.3 18.5
[23:26:49.818] <TB2> INFO: enter test to run
[23:26:49.818] <TB2> INFO: test: pretest no parameter change
[23:26:49.818] <TB2> INFO: running: pretest
[23:26:49.818] <TB2> INFO: ----------------------------------------------------------------------
[23:26:49.818] <TB2> INFO: PixTestPretest::findTiming()
[23:26:49.818] <TB2> INFO: ----------------------------------------------------------------------
[23:26:49.818] <TB2> INFO: PixTestCmd::init()
[23:26:50.762] <TB2> WARNING: Not unmasking DUT, not setting Calibrate bits!

[23:28:18.607] <TB2> INFO: TBM phases: 160MHz: 7, 400MHz: 6, TBM delays: ROC(0/1):5, header/trailer: 1, token: 1
[23:28:18.607] <TB2> INFO: (success/tries = 100/100), width = 4
[23:28:18.607] <TB2> INFO: enter test to run
[23:28:18.607] <TB2> INFO: test: pretest no parameter change
[23:28:18.607] <TB2> INFO: running: pretest
[23:28:18.610] <TB2> INFO: ----------------------------------------------------------------------
[23:28:18.610] <TB2> INFO: PixTestPretest::findWorkingPixel()
[23:28:18.610] <TB2> INFO: ----------------------------------------------------------------------
[23:28:18.703] <TB2> INFO: Expecting 231680 events.
[23:28:24.481] <TB2> ERROR: <datapipe.cc/CheckEventValidity:L497> Channel 0 Number of ROCs (1) != Token Chain Length (4)

[23:28:24.564] <TB2> ERROR: <datapipe.cc/CheckEventID:L459> Channel 0 Event ID mismatch: local ID (21) != TBM ID (2)

[23:28:28.821] <TB2> INFO: 231680 events read in total (9562ms).
[23:28:28.825] <TB2> INFO: Test took 10210ms.
[23:28:29.067] <TB2> INFO: Found working pixel in all ROCs: col/row = 12/22
[23:28:29.144] <TB2> INFO: enter test to run
[23:28:29.144] <TB2> INFO: test: pretest no parameter change
[23:28:29.144] <TB2> INFO: running: pretest
[23:28:29.145] <TB2> INFO: ----------------------------------------------------------------------
[23:28:29.145] <TB2> INFO: PixTestPretest::setVthrCompCalDel()
[23:28:29.145] <TB2> INFO: ----------------------------------------------------------------------
[23:28:29.238] <TB2> INFO: Expecting 231680 events.
[23:28:39.468] <TB2> INFO: 231680 events read in total (9674ms).
[23:28:39.471] <TB2> INFO: Test took 10322ms.
[23:28:39.719] <TB2> INFO: PixTestPretest::setVthrCompCalDel() done
[23:28:39.719] <TB2> INFO: CalDel: 142 141 142 143 129 141 134 165 142 143 146 143 162 141 139 140
[23:28:39.719] <TB2> INFO: VthrComp: 51 51 51 51 51 51 51 51 51 51 51 51 51 51 51 51
[23:28:39.752] <TB2> INFO: enter test to run
[23:28:39.752] <TB2> INFO: test: pretest no parameter change
[23:28:39.752] <TB2> INFO: running: pretest
[23:28:39.753] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C0.dat
[23:28:39.753] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C1.dat
[23:28:39.753] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C2.dat
[23:28:39.753] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C3.dat
[23:28:39.753] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C4.dat
[23:28:39.753] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C5.dat
[23:28:39.753] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C6.dat
[23:28:39.753] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C7.dat
[23:28:39.753] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C8.dat
[23:28:39.754] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C9.dat
[23:28:39.754] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C10.dat
[23:28:39.754] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C11.dat
[23:28:39.754] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C12.dat
[23:28:39.754] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C13.dat
[23:28:39.754] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C14.dat
[23:28:39.754] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters_C15.dat
[23:28:39.754] <TB2> INFO: enter test to run
[23:28:39.754] <TB2> INFO: test: fulltest no parameter change
[23:28:39.754] <TB2> INFO: running: fulltest
[23:28:39.754] <TB2> INFO: ######################################################################
[23:28:39.754] <TB2> INFO: PixTestFullTest::doTest()
[23:28:39.754] <TB2> INFO: ######################################################################
[23:28:39.755] <TB2> INFO: ######################################################################
[23:28:39.756] <TB2> INFO: PixTestAlive::doTest()
[23:28:39.756] <TB2> INFO: ######################################################################
[23:28:39.757] <TB2> INFO: ----------------------------------------------------------------------
[23:28:39.757] <TB2> INFO: PixTestAlive::aliveTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[23:28:39.757] <TB2> INFO: ----------------------------------------------------------------------
[23:28:40.020] <TB2> INFO: Expecting 41600 events.
[23:28:43.808] <TB2> INFO: 41600 events read in total (3232ms).
[23:28:43.809] <TB2> INFO: Test took 4051ms.
[23:28:44.045] <TB2> INFO: PixTestAlive::aliveTest() done
[23:28:44.045] <TB2> INFO: number of dead pixels (per ROC): 0 0 0 0 0 0 0 0 2 0 0 0 0 0 0 0
[23:28:44.047] <TB2> INFO: ----------------------------------------------------------------------
[23:28:44.047] <TB2> INFO: PixTestAlive::maskTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[23:28:44.047] <TB2> INFO: ----------------------------------------------------------------------
[23:28:44.313] <TB2> INFO: Expecting 41600 events.
[23:28:47.247] <TB2> INFO: 41600 events read in total (2378ms).
[23:28:47.247] <TB2> INFO: Test took 3198ms.
[23:28:47.248] <TB2> INFO: mask vs. old pixelAlive PixelAlive_C0_V0 .. PixelAlive_C15_V0
[23:28:47.494] <TB2> INFO: PixTestAlive::maskTest() done
[23:28:47.494] <TB2> INFO: number of mask-defect pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[23:28:47.495] <TB2> INFO: ----------------------------------------------------------------------
[23:28:47.496] <TB2> INFO: PixTestAlive::addressDecodingTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[23:28:47.496] <TB2> INFO: ----------------------------------------------------------------------
[23:28:47.767] <TB2> INFO: Expecting 41600 events.
[23:28:51.551] <TB2> INFO: 41600 events read in total (3228ms).
[23:28:51.552] <TB2> INFO: Test took 4055ms.
[23:28:51.773] <TB2> INFO: PixTestAlive::addressDecodingTest() done
[23:28:51.773] <TB2> INFO: number of address-decoding pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[23:28:51.773] <TB2> INFO: PixTestAlive::doTest() done, duration: 12 seconds
[23:28:51.773] <TB2> INFO: Decoding statistics:
[23:28:51.773] <TB2> INFO: General information:
[23:28:51.773] <TB2> INFO: 16bit words read: 0
[23:28:51.773] <TB2> INFO: valid events total: 0
[23:28:51.773] <TB2> INFO: empty events: 0
[23:28:51.773] <TB2> INFO: valid events with pixels: 0
[23:28:51.773] <TB2> INFO: valid pixel hits: 0
[23:28:51.773] <TB2> INFO: Event errors: 0
[23:28:51.773] <TB2> INFO: start marker: 0
[23:28:51.773] <TB2> INFO: stop marker: 0
[23:28:51.773] <TB2> INFO: overflow: 0
[23:28:51.773] <TB2> INFO: invalid 5bit words: 0
[23:28:51.773] <TB2> INFO: invalid XOR eye diagram: 0
[23:28:51.773] <TB2> INFO: frame (failed synchr.): 0
[23:28:51.773] <TB2> INFO: idle data (no TBM trl): 0
[23:28:51.773] <TB2> INFO: no data (only TBM hdr): 0
[23:28:51.773] <TB2> INFO: TBM errors: 0
[23:28:51.773] <TB2> INFO: flawed TBM headers: 0
[23:28:51.773] <TB2> INFO: flawed TBM trailers: 0
[23:28:51.773] <TB2> INFO: event ID mismatches: 0
[23:28:51.773] <TB2> INFO: ROC errors: 0
[23:28:51.773] <TB2> INFO: missing ROC header(s): 0
[23:28:51.773] <TB2> INFO: misplaced readback start: 0
[23:28:51.773] <TB2> INFO: Pixel decoding errors: 0
[23:28:51.773] <TB2> INFO: pixel data incomplete: 0
[23:28:51.773] <TB2> INFO: pixel address: 0
[23:28:51.773] <TB2> INFO: pulse height fill bit: 0
[23:28:51.773] <TB2> INFO: buffer corruption: 0
[23:28:51.780] <TB2> INFO: ######################################################################
[23:28:51.780] <TB2> INFO: PixTestBBMap::doTest() Ntrig = 5, VcalS = 250 (high range)
[23:28:51.780] <TB2> INFO: ######################################################################
[23:28:51.788] <TB2> INFO: ---> dac: VthrComp name: calSMap ntrig: 5 dacrange: 0 .. 149 (-1/-1) hits flags = 514 (plus default)
[23:28:51.801] <TB2> INFO: dacScan split into 1 runs with ntrig = 5
[23:28:51.801] <TB2> INFO: run 1 of 1
[23:28:52.082] <TB2> INFO: Expecting 3120000 events.
[23:29:33.678] <TB2> INFO: 855320 events read in total (41040ms).
[23:30:13.549] <TB2> INFO: 1696905 events read in total (80911ms).
[23:30:53.795] <TB2> INFO: 2547180 events read in total (121157ms).
[23:31:20.867] <TB2> INFO: 3120000 events read in total (148229ms).
[23:31:20.911] <TB2> INFO: Test took 149110ms.
[23:31:44.620] <TB2> INFO: PixTestBBMap::doTest() done, duration: 172 seconds
[23:31:44.620] <TB2> INFO: number of dead bumps (per ROC): 3 0 1 2 0 1 2 9 0 0 0 1 6 5 4 0
[23:31:44.620] <TB2> INFO: separation cut (per ROC): 94 93 79 102 89 97 96 79 64 68 93 76 82 88 88 93
[23:31:44.620] <TB2> INFO: Decoding statistics:
[23:31:44.620] <TB2> INFO: General information:
[23:31:44.620] <TB2> INFO: 16bit words read: 0
[23:31:44.620] <TB2> INFO: valid events total: 0
[23:31:44.620] <TB2> INFO: empty events: 0
[23:31:44.620] <TB2> INFO: valid events with pixels: 0
[23:31:44.620] <TB2> INFO: valid pixel hits: 0
[23:31:44.620] <TB2> INFO: Event errors: 0
[23:31:44.620] <TB2> INFO: start marker: 0
[23:31:44.620] <TB2> INFO: stop marker: 0
[23:31:44.620] <TB2> INFO: overflow: 0
[23:31:44.620] <TB2> INFO: invalid 5bit words: 0
[23:31:44.620] <TB2> INFO: invalid XOR eye diagram: 0
[23:31:44.620] <TB2> INFO: frame (failed synchr.): 0
[23:31:44.620] <TB2> INFO: idle data (no TBM trl): 0
[23:31:44.620] <TB2> INFO: no data (only TBM hdr): 0
[23:31:44.620] <TB2> INFO: TBM errors: 0
[23:31:44.620] <TB2> INFO: flawed TBM headers: 0
[23:31:44.620] <TB2> INFO: flawed TBM trailers: 0
[23:31:44.620] <TB2> INFO: event ID mismatches: 0
[23:31:44.620] <TB2> INFO: ROC errors: 0
[23:31:44.620] <TB2> INFO: missing ROC header(s): 0
[23:31:44.620] <TB2> INFO: misplaced readback start: 0
[23:31:44.620] <TB2> INFO: Pixel decoding errors: 0
[23:31:44.620] <TB2> INFO: pixel data incomplete: 0
[23:31:44.620] <TB2> INFO: pixel address: 0
[23:31:44.620] <TB2> INFO: pulse height fill bit: 0
[23:31:44.620] <TB2> INFO: buffer corruption: 0
[23:31:44.697] <TB2> INFO: ######################################################################
[23:31:44.697] <TB2> INFO: PixTestScurves::fullTest() ntrig = 50, dacs/step = -1, ntrig/step = -1
[23:31:44.697] <TB2> INFO: ######################################################################
[23:31:44.697] <TB2> INFO: ----------------------------------------------------------------------
[23:31:44.697] <TB2> INFO: PixTestScurves::scurves(Vcal), ntrig = 50, dacs/step = -1, ntrig/step = -1
[23:31:44.697] <TB2> INFO: ----------------------------------------------------------------------
[23:31:44.697] <TB2> INFO: ---> dac: Vcal name: scurveVcal ntrig: 50 dacrange: 25 .. 150 (-1/-1) hits flags = 528 (plus default)
[23:31:44.706] <TB2> INFO: dacScan split into 1 runs with ntrig = 50
[23:31:44.706] <TB2> INFO: run 1 of 1
[23:31:44.978] <TB2> INFO: Expecting 26208000 events.
[23:32:18.027] <TB2> INFO: 877400 events read in total (32493ms).
[23:32:50.625] <TB2> INFO: 1742500 events read in total (65091ms).
[23:33:23.149] <TB2> INFO: 2606650 events read in total (97615ms).
[23:33:55.789] <TB2> INFO: 3468250 events read in total (130255ms).
[23:34:28.493] <TB2> INFO: 4329650 events read in total (162959ms).
[23:35:00.715] <TB2> INFO: 5190450 events read in total (195181ms).
[23:35:33.113] <TB2> INFO: 6051850 events read in total (227579ms).
[23:36:05.511] <TB2> INFO: 6910400 events read in total (259977ms).
[23:36:38.015] <TB2> INFO: 7770850 events read in total (292481ms).
[23:37:10.403] <TB2> INFO: 8629250 events read in total (324869ms).
[23:37:42.980] <TB2> INFO: 9487750 events read in total (357446ms).
[23:38:15.603] <TB2> INFO: 10346800 events read in total (390069ms).
[23:38:47.880] <TB2> INFO: 11204800 events read in total (422346ms).
[23:39:19.866] <TB2> INFO: 12061350 events read in total (454332ms).
[23:39:52.769] <TB2> INFO: 12916100 events read in total (487235ms).
[23:40:25.018] <TB2> INFO: 13766500 events read in total (519484ms).
[23:40:57.096] <TB2> INFO: 14613800 events read in total (551562ms).
[23:41:29.566] <TB2> INFO: 15460800 events read in total (584032ms).
[23:42:01.937] <TB2> INFO: 16307700 events read in total (616403ms).
[23:42:34.239] <TB2> INFO: 17151500 events read in total (648705ms).
[23:43:06.525] <TB2> INFO: 17995750 events read in total (680991ms).
[23:43:38.812] <TB2> INFO: 18840250 events read in total (713278ms).
[23:44:10.777] <TB2> INFO: 19680450 events read in total (745243ms).
[23:44:42.979] <TB2> INFO: 20523000 events read in total (777445ms).
[23:45:15.212] <TB2> INFO: 21366800 events read in total (809678ms).
[23:45:47.635] <TB2> INFO: 22210700 events read in total (842101ms).
[23:46:19.601] <TB2> INFO: 23052750 events read in total (874067ms).
[23:46:51.662] <TB2> INFO: 23898750 events read in total (906128ms).
[23:47:23.710] <TB2> INFO: 24744300 events read in total (938176ms).
[23:47:56.227] <TB2> INFO: 25589400 events read in total (970693ms).
[23:48:19.697] <TB2> INFO: 26208000 events read in total (994163ms).
[23:48:19.736] <TB2> INFO: Test took 995030ms.
[23:48:20.068] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:22.071] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:23.729] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:25.151] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:26.584] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:27.987] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:29.416] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:30.815] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:32.318] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:34.007] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:35.651] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:37.218] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:38.770] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:40.243] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:41.740] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:43.327] <TB2> INFO: dumping ASCII scurve output file: SCurveData
[23:48:44.904] <TB2> INFO: PixTestScurves::scurves() done
[23:48:44.904] <TB2> INFO: Vcal mean: 93.89 99.17 92.54 104.95 93.66 98.59 85.80 77.97 74.00 77.85 90.10 79.07 87.01 86.14 91.50 87.57
[23:48:44.904] <TB2> INFO: Vcal RMS: 5.26 5.50 5.66 5.96 5.75 5.66 5.35 4.34 4.94 4.38 6.25 4.43 5.08 5.62 5.38 5.81
[23:48:44.904] <TB2> INFO: PixTestScurves::fullTest() done, duration: 1020 seconds
[23:48:44.904] <TB2> INFO: Decoding statistics:
[23:48:44.904] <TB2> INFO: General information:
[23:48:44.904] <TB2> INFO: 16bit words read: 0
[23:48:44.904] <TB2> INFO: valid events total: 0
[23:48:44.904] <TB2> INFO: empty events: 0
[23:48:44.905] <TB2> INFO: valid events with pixels: 0
[23:48:44.905] <TB2> INFO: valid pixel hits: 0
[23:48:44.905] <TB2> INFO: Event errors: 0
[23:48:44.905] <TB2> INFO: start marker: 0
[23:48:44.905] <TB2> INFO: stop marker: 0
[23:48:44.905] <TB2> INFO: overflow: 0
[23:48:44.905] <TB2> INFO: invalid 5bit words: 0
[23:48:44.905] <TB2> INFO: invalid XOR eye diagram: 0
[23:48:44.905] <TB2> INFO: frame (failed synchr.): 0
[23:48:44.905] <TB2> INFO: idle data (no TBM trl): 0
[23:48:44.905] <TB2> INFO: no data (only TBM hdr): 0
[23:48:44.905] <TB2> INFO: TBM errors: 0
[23:48:44.905] <TB2> INFO: flawed TBM headers: 0
[23:48:44.905] <TB2> INFO: flawed TBM trailers: 0
[23:48:44.905] <TB2> INFO: event ID mismatches: 0
[23:48:44.905] <TB2> INFO: ROC errors: 0
[23:48:44.905] <TB2> INFO: missing ROC header(s): 0
[23:48:44.905] <TB2> INFO: misplaced readback start: 0
[23:48:44.905] <TB2> INFO: Pixel decoding errors: 0
[23:48:44.905] <TB2> INFO: pixel data incomplete: 0
[23:48:44.905] <TB2> INFO: pixel address: 0
[23:48:44.905] <TB2> INFO: pulse height fill bit: 0
[23:48:44.905] <TB2> INFO: buffer corruption: 0
[23:48:44.977] <TB2> INFO: ######################################################################
[23:48:44.977] <TB2> INFO: PixTestTrim::doTest()
[23:48:44.977] <TB2> INFO: ######################################################################
[23:48:44.978] <TB2> INFO: ----------------------------------------------------------------------
[23:48:44.978] <TB2> INFO: PixTestTrim::trimTest() ntrig = 10, vcal = 35
[23:48:44.978] <TB2> INFO: ----------------------------------------------------------------------
[23:48:45.057] <TB2> INFO: ---> VthrComp thr map (minimal VthrComp)
[23:48:45.057] <TB2> INFO: ---> dac: vthrcomp name: TrimThr0 ntrig: 10 dacrange: 10 .. 160 (-1/-1) hits flags = 528 (plus default)
[23:48:45.066] <TB2> INFO: dacScan split into 1 runs with ntrig = 10
[23:48:45.066] <TB2> INFO: run 1 of 1
[23:48:45.329] <TB2> INFO: Expecting 6281600 events.
[23:49:25.436] <TB2> INFO: 1083710 events read in total (39547ms).
[23:50:05.105] <TB2> INFO: 2161120 events read in total (79216ms).
[23:50:44.669] <TB2> INFO: 3231550 events read in total (118780ms).
[23:51:24.217] <TB2> INFO: 4308510 events read in total (158328ms).
[23:52:03.653] <TB2> INFO: 5387270 events read in total (197765ms).
[23:52:36.621] <TB2> INFO: 6281600 events read in total (230732ms).
[23:52:36.651] <TB2> INFO: Test took 231585ms.
[23:52:55.897] <TB2> INFO: ROC 0 VthrComp = 96
[23:52:55.897] <TB2> INFO: ROC 1 VthrComp = 103
[23:52:55.897] <TB2> INFO: ROC 2 VthrComp = 90
[23:52:55.898] <TB2> INFO: ROC 3 VthrComp = 103
[23:52:55.898] <TB2> INFO: ROC 4 VthrComp = 98
[23:52:55.898] <TB2> INFO: ROC 5 VthrComp = 101
[23:52:55.898] <TB2> INFO: ROC 6 VthrComp = 89
[23:52:55.898] <TB2> INFO: ROC 7 VthrComp = 80
[23:52:55.898] <TB2> INFO: ROC 8 VthrComp = 78
[23:52:55.898] <TB2> INFO: ROC 9 VthrComp = 83
[23:52:55.898] <TB2> INFO: ROC 10 VthrComp = 90
[23:52:55.898] <TB2> INFO: ROC 11 VthrComp = 83
[23:52:55.898] <TB2> INFO: ROC 12 VthrComp = 89
[23:52:55.899] <TB2> INFO: ROC 13 VthrComp = 89
[23:52:55.899] <TB2> INFO: ROC 14 VthrComp = 93
[23:52:55.899] <TB2> INFO: ROC 15 VthrComp = 88
[23:52:55.899] <TB2> INFO: ---> Vcal thr map (pixel with maximum Vcal thr)
[23:52:55.899] <TB2> INFO: ---> dac: vcal name: TrimThr1 ntrig: 10 dacrange: 10 .. 160 (-1/-1) hits flags = 528 (plus default)
[23:52:55.908] <TB2> INFO: dacScan split into 1 runs with ntrig = 10
[23:52:55.908] <TB2> INFO: run 1 of 1
[23:52:56.167] <TB2> INFO: Expecting 6281600 events.
[23:53:31.978] <TB2> INFO: 756970 events read in total (35255ms).
[23:54:06.834] <TB2> INFO: 1511400 events read in total (70111ms).
[23:54:41.807] <TB2> INFO: 2267280 events read in total (105084ms).
[23:55:16.860] <TB2> INFO: 3023570 events read in total (140137ms).
[23:55:51.519] <TB2> INFO: 3774550 events read in total (174796ms).
[23:56:26.366] <TB2> INFO: 4521970 events read in total (209643ms).
[23:57:01.027] <TB2> INFO: 5267370 events read in total (244304ms).
[23:57:35.694] <TB2> INFO: 6012640 events read in total (278971ms).
[23:57:48.089] <TB2> INFO: 6281600 events read in total (291366ms).
[23:57:48.134] <TB2> INFO: Test took 292226ms.
[23:58:12.510] <TB2> INFO: roc 0 with ID = 0 has maximal Vcal 57.98 for pixel 18/79 mean/min/max = 45.0381/32.003/58.0731
[23:58:12.510] <TB2> INFO: roc 1 with ID = 1 has maximal Vcal 58.7481 for pixel 17/70 mean/min/max = 45.5215/32.0248/59.0181
[23:58:12.511] <TB2> INFO: roc 2 with ID = 2 has maximal Vcal 60.4302 for pixel 0/18 mean/min/max = 46.4991/32.5017/60.4964
[23:58:12.511] <TB2> INFO: roc 3 with ID = 3 has maximal Vcal 61.0096 for pixel 28/77 mean/min/max = 46.5525/31.9505/61.1545
[23:58:12.511] <TB2> INFO: roc 4 with ID = 4 has maximal Vcal 59.6024 for pixel 2/6 mean/min/max = 45.5095/31.3428/59.6762
[23:58:12.511] <TB2> INFO: roc 5 with ID = 5 has maximal Vcal 59.7765 for pixel 1/8 mean/min/max = 45.9973/32.1661/59.8286
[23:58:12.512] <TB2> INFO: roc 6 with ID = 6 has maximal Vcal 59.1007 for pixel 26/27 mean/min/max = 46.1821/33.1738/59.1904
[23:58:12.512] <TB2> INFO: roc 7 with ID = 7 has maximal Vcal 58.0981 for pixel 0/64 mean/min/max = 45.4478/32.6241/58.2714
[23:58:12.512] <TB2> INFO: roc 8 with ID = 8 has maximal Vcal 59.4493 for pixel 51/3 mean/min/max = 47.335/35.1643/59.5058
[23:58:12.513] <TB2> INFO: roc 9 with ID = 9 has maximal Vcal 57.6814 for pixel 12/1 mean/min/max = 44.7513/31.8085/57.6941
[23:58:12.513] <TB2> INFO: roc 10 with ID = 10 has maximal Vcal 61.635 for pixel 8/75 mean/min/max = 46.897/32.0026/61.7914
[23:58:12.513] <TB2> INFO: roc 11 with ID = 11 has maximal Vcal 57.8652 for pixel 2/78 mean/min/max = 45.0582/32.1735/57.9429
[23:58:12.514] <TB2> INFO: roc 12 with ID = 12 has maximal Vcal 57.6986 for pixel 25/37 mean/min/max = 45.3748/32.9675/57.7822
[23:58:12.514] <TB2> INFO: roc 13 with ID = 13 has maximal Vcal 59.963 for pixel 11/79 mean/min/max = 46.5064/32.8831/60.1298
[23:58:12.514] <TB2> INFO: roc 14 with ID = 14 has maximal Vcal 58.7503 for pixel 10/1 mean/min/max = 45.8107/32.8364/58.785
[23:58:12.514] <TB2> INFO: roc 15 with ID = 15 has maximal Vcal 61.2549 for pixel 26/9 mean/min/max = 46.6283/31.9777/61.2789
[23:58:12.515] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[23:58:12.605] <TB2> INFO: Expecting 514560 events.
[23:58:25.634] <TB2> INFO: 514560 events read in total (12473ms).
[23:58:25.640] <TB2> INFO: Expecting 514560 events.
[23:58:38.636] <TB2> INFO: 514560 events read in total (12581ms).
[23:58:38.644] <TB2> INFO: Expecting 514560 events.
[23:58:51.369] <TB2> INFO: 514560 events read in total (12314ms).
[23:58:51.378] <TB2> INFO: Expecting 514560 events.
[23:59:04.306] <TB2> INFO: 514560 events read in total (12507ms).
[23:59:04.319] <TB2> INFO: Expecting 514560 events.
[23:59:17.154] <TB2> INFO: 514560 events read in total (12430ms).
[23:59:17.168] <TB2> INFO: Expecting 514560 events.
[23:59:30.179] <TB2> INFO: 514560 events read in total (12604ms).
[23:59:30.196] <TB2> INFO: Expecting 514560 events.
[23:59:43.124] <TB2> INFO: 514560 events read in total (12526ms).
[23:59:43.144] <TB2> INFO: Expecting 514560 events.
[23:59:55.812] <TB2> INFO: 514560 events read in total (12266ms).
[23:59:55.831] <TB2> INFO: Expecting 514560 events.
[00:00:08.731] <TB2> INFO: 514560 events read in total (12490ms).
[00:00:08.758] <TB2> INFO: Expecting 514560 events.
[00:00:21.683] <TB2> INFO: 514560 events read in total (12524ms).
[00:00:21.710] <TB2> INFO: Expecting 514560 events.
[00:00:34.483] <TB2> INFO: 514560 events read in total (12372ms).
[00:00:34.514] <TB2> INFO: Expecting 514560 events.
[00:00:47.206] <TB2> INFO: 514560 events read in total (12290ms).
[00:00:47.234] <TB2> INFO: Expecting 514560 events.
[00:01:00.076] <TB2> INFO: 514560 events read in total (12440ms).
[00:01:00.112] <TB2> INFO: Expecting 514560 events.
[00:01:12.883] <TB2> INFO: 514560 events read in total (12369ms).
[00:01:12.914] <TB2> INFO: Expecting 514560 events.
[00:01:25.732] <TB2> INFO: 514560 events read in total (12416ms).
[00:01:25.763] <TB2> INFO: Expecting 514560 events.
[00:01:38.512] <TB2> INFO: 514560 events read in total (12347ms).
[00:01:38.554] <TB2> INFO: Test took 206039ms.
[00:01:39.604] <TB2> INFO: ---> dac: vcal name: TrimThr2 ntrig: 10 dacrange: 0 .. 150 (-1/-1) hits flags = 528 (plus default)
[00:01:39.616] <TB2> INFO: dacScan split into 1 runs with ntrig = 10
[00:01:39.616] <TB2> INFO: run 1 of 1
[00:01:39.911] <TB2> INFO: Expecting 6281600 events.
[00:02:15.049] <TB2> INFO: 742010 events read in total (34582ms).
[00:02:49.819] <TB2> INFO: 1482240 events read in total (69352ms).
[00:03:24.773] <TB2> INFO: 2223410 events read in total (104306ms).
[00:03:59.527] <TB2> INFO: 2964670 events read in total (139060ms).
[00:04:34.068] <TB2> INFO: 3700380 events read in total (173601ms).
[00:05:08.355] <TB2> INFO: 4432040 events read in total (207888ms).
[00:05:42.836] <TB2> INFO: 5161870 events read in total (242369ms).
[00:06:17.817] <TB2> INFO: 5891130 events read in total (277350ms).
[00:06:36.979] <TB2> INFO: 6281600 events read in total (296512ms).
[00:06:37.034] <TB2> INFO: Test took 297418ms.
[00:07:02.282] <TB2> INFO: ---> TrimStepCorr4 extremal thresholds: 0.068326 .. 255.000000
[00:07:02.371] <TB2> INFO: ---> dac: vcal name: trimStepCorr4 ntrig: 10 dacrange: 0 .. 255 (-1/-1) hits flags = 528 (plus default)
[00:07:02.380] <TB2> INFO: dacScan split into 1 runs with ntrig = 10
[00:07:02.380] <TB2> INFO: run 1 of 1
[00:07:02.672] <TB2> INFO: Expecting 10649600 events.
[00:07:37.259] <TB2> INFO: 712350 events read in total (34031ms).
[00:08:11.042] <TB2> INFO: 1424600 events read in total (67814ms).
[00:08:45.343] <TB2> INFO: 2136990 events read in total (102115ms).
[00:09:19.313] <TB2> INFO: 2849230 events read in total (136085ms).
[00:09:53.477] <TB2> INFO: 3561780 events read in total (170249ms).
[00:10:27.819] <TB2> INFO: 4274480 events read in total (204591ms).
[00:11:02.042] <TB2> INFO: 4987210 events read in total (238814ms).
[00:11:36.905] <TB2> INFO: 5699610 events read in total (273677ms).
[00:12:10.986] <TB2> INFO: 6411870 events read in total (307758ms).
[00:12:44.996] <TB2> INFO: 7123390 events read in total (341768ms).
[00:13:19.156] <TB2> INFO: 7834810 events read in total (375928ms).
[00:13:53.006] <TB2> INFO: 8545840 events read in total (409778ms).
[00:14:26.873] <TB2> INFO: 9256820 events read in total (443646ms).
[00:15:00.873] <TB2> INFO: 9967690 events read in total (477645ms).
[00:15:34.145] <TB2> INFO: 10649600 events read in total (510917ms).
[00:15:34.274] <TB2> INFO: Test took 511894ms.
[00:16:03.263] <TB2> INFO: ---> TrimStepCorr2 extremal thresholds: 15.010108 .. 44.261238
[00:16:03.351] <TB2> INFO: ---> dac: vcal name: trimStepCorr2 ntrig: 10 dacrange: 5 .. 54 (-1/-1) hits flags = 528 (plus default)
[00:16:03.360] <TB2> INFO: dacScan split into 1 runs with ntrig = 10
[00:16:03.360] <TB2> INFO: run 1 of 1
[00:16:03.619] <TB2> INFO: Expecting 2080000 events.
[00:16:42.297] <TB2> INFO: 945090 events read in total (38122ms).
[00:17:20.621] <TB2> INFO: 1888460 events read in total (76446ms).
[00:17:28.600] <TB2> INFO: 2080000 events read in total (84426ms).
[00:17:28.618] <TB2> INFO: Test took 85260ms.
[00:17:42.007] <TB2> INFO: ---> TrimStepCorr1a extremal thresholds: 20.211322 .. 41.688691
[00:17:42.082] <TB2> INFO: ---> dac: vcal name: trimStepCorr1a ntrig: 10 dacrange: 10 .. 51 (-1/-1) hits flags = 528 (plus default)
[00:17:42.091] <TB2> INFO: dacScan split into 1 runs with ntrig = 10
[00:17:42.091] <TB2> INFO: run 1 of 1
[00:17:42.351] <TB2> INFO: Expecting 1747200 events.
[00:18:21.271] <TB2> INFO: 944990 events read in total (38364ms).
[00:18:53.597] <TB2> INFO: 1747200 events read in total (70690ms).
[00:18:53.622] <TB2> INFO: Test took 71532ms.
[00:19:07.455] <TB2> INFO: ---> TrimStepCorr1b extremal thresholds: 22.317508 .. 40.344103
[00:19:07.544] <TB2> INFO: ---> dac: vcal name: trimStepCorr1b ntrig: 10 dacrange: 12 .. 50 (-1/-1) hits flags = 528 (plus default)
[00:19:07.553] <TB2> INFO: dacScan split into 1 runs with ntrig = 10
[00:19:07.553] <TB2> INFO: run 1 of 1
[00:19:07.842] <TB2> INFO: Expecting 1622400 events.
[00:19:47.614] <TB2> INFO: 941470 events read in total (39216ms).
[00:20:15.224] <TB2> INFO: 1622400 events read in total (66826ms).
[00:20:15.242] <TB2> INFO: Test took 67689ms.
[00:20:29.800] <TB2> INFO: ---> TrimThrFinal extremal thresholds: 15 .. 55
[00:20:29.800] <TB2> INFO: ---> dac: vcal name: TrimThrFinal ntrig: 10 dacrange: 15 .. 55 (-1/-1) hits flags = 528 (plus default)
[00:20:29.809] <TB2> INFO: dacScan split into 1 runs with ntrig = 10
[00:20:29.809] <TB2> INFO: run 1 of 1
[00:20:30.080] <TB2> INFO: Expecting 1705600 events.
[00:21:07.777] <TB2> INFO: 878800 events read in total (37140ms).
[00:21:42.949] <TB2> INFO: 1705600 events read in total (72312ms).
[00:21:42.978] <TB2> INFO: Test took 73170ms.
[00:21:57.607] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C0.dat
[00:21:57.607] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C1.dat
[00:21:57.607] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C2.dat
[00:21:57.607] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C3.dat
[00:21:57.607] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C4.dat
[00:21:57.607] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C5.dat
[00:21:57.607] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C6.dat
[00:21:57.608] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C7.dat
[00:21:57.608] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C8.dat
[00:21:57.608] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C9.dat
[00:21:57.608] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C10.dat
[00:21:57.608] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C11.dat
[00:21:57.608] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C12.dat
[00:21:57.608] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C13.dat
[00:21:57.608] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C14.dat
[00:21:57.609] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C15.dat
[00:21:57.609] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C0.dat
[00:21:57.617] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C1.dat
[00:21:57.624] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C2.dat
[00:21:57.630] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C3.dat
[00:21:57.638] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C4.dat
[00:21:57.646] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C5.dat
[00:21:57.655] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C6.dat
[00:21:57.663] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C7.dat
[00:21:57.670] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C8.dat
[00:21:57.676] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C9.dat
[00:21:57.683] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C10.dat
[00:21:57.690] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C11.dat
[00:21:57.697] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C12.dat
[00:21:57.704] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C13.dat
[00:21:57.711] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C14.dat
[00:21:57.718] <TB2> INFO: write trim parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//trimParameters35_C15.dat
[00:21:57.725] <TB2> INFO: PixTestTrim::trimTest() done
[00:21:57.725] <TB2> INFO: vtrim: 98 120 96 108 95 108 101 80 90 108 100 94 90 99 103 96
[00:21:57.725] <TB2> INFO: vthrcomp: 96 103 90 103 98 101 89 80 78 83 90 83 89 89 93 88
[00:21:57.725] <TB2> INFO: vcal mean: 34.98 35.00 34.96 34.96 34.99 34.98 34.86 35.08 34.96 34.96 34.95 34.98 34.98 34.96 35.01 34.97
[00:21:57.725] <TB2> INFO: vcal RMS: 0.85 0.98 0.90 0.89 0.88 0.83 0.84 0.82 1.11 0.81 0.91 0.85 0.83 0.83 0.87 0.99
[00:21:57.725] <TB2> INFO: bits mean: 9.33 9.82 8.94 9.29 9.58 9.30 9.27 8.81 7.96 9.68 9.33 9.93 9.55 9.01 9.55 9.16
[00:21:57.725] <TB2> INFO: bits RMS: 2.80 2.55 2.82 2.70 2.78 2.73 2.57 2.90 2.77 2.69 2.68 2.54 2.57 2.74 2.55 2.77
[00:21:57.732] <TB2> INFO: ----------------------------------------------------------------------
[00:21:57.732] <TB2> INFO: PixTestTrim::trimBitTest() ntrig = 5, vtrims = 254 126 63 32
[00:21:57.732] <TB2> INFO: ----------------------------------------------------------------------
[00:21:57.734] <TB2> INFO: ---> dac: Vcal name: TrimBitsThr0 ntrig: 5 dacrange: 0 .. 199 (-1/-1) hits flags = 528 (plus default)
[00:21:57.743] <TB2> INFO: dacScan split into 1 runs with ntrig = 5
[00:21:57.743] <TB2> INFO: run 1 of 1
[00:21:58.016] <TB2> INFO: Expecting 4160000 events.
[00:22:39.625] <TB2> INFO: 912710 events read in total (41052ms).
[00:23:20.654] <TB2> INFO: 1819550 events read in total (82081ms).
[00:24:01.278] <TB2> INFO: 2718300 events read in total (122705ms).
[00:24:41.913] <TB2> INFO: 3613530 events read in total (163340ms).
[00:25:06.639] <TB2> INFO: 4160000 events read in total (188066ms).
[00:25:06.680] <TB2> INFO: Test took 188936ms.
[00:25:37.591] <TB2> INFO: ---> dac: Vcal name: TrimThr_trim14 ntrig: 5 dacrange: 0 .. 178 (-1/-1) hits flags = 528 (plus default)
[00:25:37.600] <TB2> INFO: dacScan split into 1 runs with ntrig = 5
[00:25:37.600] <TB2> INFO: run 1 of 1
[00:25:37.863] <TB2> INFO: Expecting 3723200 events.
[00:26:19.132] <TB2> INFO: 919750 events read in total (40713ms).
[00:27:00.191] <TB2> INFO: 1833195 events read in total (81772ms).
[00:27:41.275] <TB2> INFO: 2736030 events read in total (122857ms).
[00:28:21.940] <TB2> INFO: 3638105 events read in total (163521ms).
[00:28:26.320] <TB2> INFO: 3723200 events read in total (167901ms).
[00:28:26.363] <TB2> INFO: Test took 168762ms.
[00:28:56.363] <TB2> INFO: ---> dac: Vcal name: TrimThr_trim13 ntrig: 5 dacrange: 0 .. 163 (-1/-1) hits flags = 528 (plus default)
[00:28:56.372] <TB2> INFO: dacScan split into 1 runs with ntrig = 5
[00:28:56.374] <TB2> INFO: run 1 of 1
[00:28:56.661] <TB2> INFO: Expecting 3411200 events.
[00:29:38.539] <TB2> INFO: 952505 events read in total (41322ms).
[00:30:20.177] <TB2> INFO: 1895475 events read in total (82961ms).
[00:31:01.578] <TB2> INFO: 2827275 events read in total (124362ms).
[00:31:28.616] <TB2> INFO: 3411200 events read in total (151399ms).
[00:31:28.650] <TB2> INFO: Test took 152276ms.
[00:31:53.854] <TB2> INFO: ---> dac: Vcal name: TrimThr_trim11 ntrig: 5 dacrange: 0 .. 163 (-1/-1) hits flags = 528 (plus default)
[00:31:53.862] <TB2> INFO: dacScan split into 1 runs with ntrig = 5
[00:31:53.863] <TB2> INFO: run 1 of 1
[00:31:54.125] <TB2> INFO: Expecting 3411200 events.
[00:32:36.892] <TB2> INFO: 951775 events read in total (42210ms).
[00:33:18.328] <TB2> INFO: 1894025 events read in total (83646ms).
[00:33:59.459] <TB2> INFO: 2825390 events read in total (124778ms).
[00:34:25.197] <TB2> INFO: 3411200 events read in total (150515ms).
[00:34:25.251] <TB2> INFO: Test took 151388ms.
[00:34:50.258] <TB2> INFO: ---> dac: Vcal name: TrimThr_trim7 ntrig: 5 dacrange: 0 .. 164 (-1/-1) hits flags = 528 (plus default)
[00:34:50.266] <TB2> INFO: dacScan split into 1 runs with ntrig = 5
[00:34:50.266] <TB2> INFO: run 1 of 1
[00:34:50.527] <TB2> INFO: Expecting 3432000 events.
[00:35:32.558] <TB2> INFO: 948900 events read in total (41475ms).
[00:36:14.158] <TB2> INFO: 1888255 events read in total (83075ms).
[00:36:55.743] <TB2> INFO: 2816445 events read in total (124661ms).
[00:37:22.650] <TB2> INFO: 3432000 events read in total (151567ms).
[00:37:22.686] <TB2> INFO: Test took 152419ms.
[00:37:48.470] <TB2> INFO: PixTestTrim::trimBitTest() done
[00:37:48.472] <TB2> INFO: PixTestTrim::doTest() done, duration: 2943 seconds
[00:37:48.472] <TB2> INFO: Decoding statistics:
[00:37:48.472] <TB2> INFO: General information:
[00:37:48.472] <TB2> INFO: 16bit words read: 0
[00:37:48.472] <TB2> INFO: valid events total: 0
[00:37:48.472] <TB2> INFO: empty events: 0
[00:37:48.472] <TB2> INFO: valid events with pixels: 0
[00:37:48.472] <TB2> INFO: valid pixel hits: 0
[00:37:48.472] <TB2> INFO: Event errors: 0
[00:37:48.472] <TB2> INFO: start marker: 0
[00:37:48.472] <TB2> INFO: stop marker: 0
[00:37:48.472] <TB2> INFO: overflow: 0
[00:37:48.472] <TB2> INFO: invalid 5bit words: 0
[00:37:48.472] <TB2> INFO: invalid XOR eye diagram: 0
[00:37:48.472] <TB2> INFO: frame (failed synchr.): 0
[00:37:48.472] <TB2> INFO: idle data (no TBM trl): 0
[00:37:48.472] <TB2> INFO: no data (only TBM hdr): 0
[00:37:48.472] <TB2> INFO: TBM errors: 0
[00:37:48.472] <TB2> INFO: flawed TBM headers: 0
[00:37:48.472] <TB2> INFO: flawed TBM trailers: 0
[00:37:48.472] <TB2> INFO: event ID mismatches: 0
[00:37:48.472] <TB2> INFO: ROC errors: 0
[00:37:48.472] <TB2> INFO: missing ROC header(s): 0
[00:37:48.472] <TB2> INFO: misplaced readback start: 0
[00:37:48.472] <TB2> INFO: Pixel decoding errors: 0
[00:37:48.472] <TB2> INFO: pixel data incomplete: 0
[00:37:48.472] <TB2> INFO: pixel address: 0
[00:37:48.472] <TB2> INFO: pulse height fill bit: 0
[00:37:48.472] <TB2> INFO: buffer corruption: 0
[00:37:49.159] <TB2> INFO: ######################################################################
[00:37:49.159] <TB2> INFO: PixTestPhOptimization::doTest() Ntrig = 10
[00:37:49.159] <TB2> INFO: ######################################################################
[00:37:49.422] <TB2> INFO: Expecting 41600 events.
[00:37:53.146] <TB2> INFO: 41600 events read in total (3168ms).
[00:37:53.146] <TB2> INFO: Test took 3985ms.
[00:37:53.618] <TB2> INFO: Expecting 41600 events.
[00:37:57.396] <TB2> INFO: 41600 events read in total (3221ms).
[00:37:57.396] <TB2> INFO: Test took 4046ms.
[00:37:57.708] <TB2> INFO: Expecting 41600 events.
[00:38:01.571] <TB2> INFO: 41600 events read in total (3307ms).
[00:38:01.571] <TB2> INFO: Test took 4153ms.
[00:38:01.827] <TB2> INFO: Expecting 2560 events.
[00:38:02.680] <TB2> INFO: 2560 events read in total (297ms).
[00:38:02.680] <TB2> INFO: Test took 1095ms.
[00:38:02.985] <TB2> INFO: Expecting 2560 events.
[00:38:03.840] <TB2> INFO: 2560 events read in total (299ms).
[00:38:03.840] <TB2> INFO: Test took 1159ms.
[00:38:04.145] <TB2> INFO: Expecting 2560 events.
[00:38:05.000] <TB2> INFO: 2560 events read in total (299ms).
[00:38:05.000] <TB2> INFO: Test took 1160ms.
[00:38:05.305] <TB2> INFO: Expecting 2560 events.
[00:38:06.163] <TB2> INFO: 2560 events read in total (302ms).
[00:38:06.163] <TB2> INFO: Test took 1160ms.
[00:38:06.469] <TB2> INFO: Expecting 2560 events.
[00:38:07.324] <TB2> INFO: 2560 events read in total (299ms).
[00:38:07.325] <TB2> INFO: Test took 1161ms.
[00:38:07.629] <TB2> INFO: Expecting 2560 events.
[00:38:08.482] <TB2> INFO: 2560 events read in total (297ms).
[00:38:08.482] <TB2> INFO: Test took 1157ms.
[00:38:08.787] <TB2> INFO: Expecting 2560 events.
[00:38:09.645] <TB2> INFO: 2560 events read in total (302ms).
[00:38:09.645] <TB2> INFO: Test took 1162ms.
[00:38:09.951] <TB2> INFO: Expecting 2560 events.
[00:38:10.805] <TB2> INFO: 2560 events read in total (298ms).
[00:38:10.805] <TB2> INFO: Test took 1159ms.
[00:38:11.109] <TB2> INFO: Expecting 2560 events.
[00:38:11.968] <TB2> INFO: 2560 events read in total (302ms).
[00:38:11.968] <TB2> INFO: Test took 1162ms.
[00:38:12.274] <TB2> INFO: Expecting 2560 events.
[00:38:13.129] <TB2> INFO: 2560 events read in total (299ms).
[00:38:13.129] <TB2> INFO: Test took 1161ms.
[00:38:13.433] <TB2> INFO: Expecting 2560 events.
[00:38:14.287] <TB2> INFO: 2560 events read in total (297ms).
[00:38:14.287] <TB2> INFO: Test took 1158ms.
[00:38:14.592] <TB2> INFO: Expecting 2560 events.
[00:38:15.448] <TB2> INFO: 2560 events read in total (299ms).
[00:38:15.449] <TB2> INFO: Test took 1162ms.
[00:38:15.754] <TB2> INFO: Expecting 2560 events.
[00:38:16.608] <TB2> INFO: 2560 events read in total (298ms).
[00:38:16.608] <TB2> INFO: Test took 1159ms.
[00:38:16.913] <TB2> INFO: Expecting 2560 events.
[00:38:17.768] <TB2> INFO: 2560 events read in total (298ms).
[00:38:17.768] <TB2> INFO: Test took 1159ms.
[00:38:18.073] <TB2> INFO: Expecting 2560 events.
[00:38:18.926] <TB2> INFO: 2560 events read in total (298ms).
[00:38:18.927] <TB2> INFO: Test took 1158ms.
[00:38:19.232] <TB2> INFO: Expecting 2560 events.
[00:38:20.087] <TB2> INFO: 2560 events read in total (299ms).
[00:38:20.087] <TB2> INFO: Test took 1160ms.
[00:38:20.091] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:38:20.393] <TB2> INFO: Expecting 655360 events.
[00:38:37.190] <TB2> INFO: 655360 events read in total (16241ms).
[00:38:37.199] <TB2> INFO: Expecting 655360 events.
[00:38:54.022] <TB2> INFO: 655360 events read in total (16421ms).
[00:38:54.038] <TB2> INFO: Expecting 655360 events.
[00:39:10.638] <TB2> INFO: 655360 events read in total (16198ms).
[00:39:10.653] <TB2> INFO: Expecting 655360 events.
[00:39:27.369] <TB2> INFO: 655360 events read in total (16314ms).
[00:39:27.389] <TB2> INFO: Expecting 655360 events.
[00:39:43.936] <TB2> INFO: 655360 events read in total (16145ms).
[00:39:43.966] <TB2> INFO: Expecting 655360 events.
[00:40:00.545] <TB2> INFO: 655360 events read in total (16178ms).
[00:40:00.571] <TB2> INFO: Expecting 655360 events.
[00:40:17.628] <TB2> INFO: 655360 events read in total (16656ms).
[00:40:17.659] <TB2> INFO: Expecting 655360 events.
[00:40:34.380] <TB2> INFO: 655360 events read in total (16320ms).
[00:40:34.413] <TB2> INFO: Expecting 655360 events.
[00:40:51.114] <TB2> INFO: 655360 events read in total (16299ms).
[00:40:51.151] <TB2> INFO: Expecting 655360 events.
[00:41:07.982] <TB2> INFO: 655360 events read in total (16429ms).
[00:41:08.026] <TB2> INFO: Expecting 655360 events.
[00:41:24.716] <TB2> INFO: 655360 events read in total (16288ms).
[00:41:24.759] <TB2> INFO: Expecting 655360 events.
[00:41:41.475] <TB2> INFO: 655360 events read in total (16314ms).
[00:41:41.522] <TB2> INFO: Expecting 655360 events.
[00:41:58.168] <TB2> INFO: 655360 events read in total (16244ms).
[00:41:58.219] <TB2> INFO: Expecting 655360 events.
[00:42:14.901] <TB2> INFO: 655360 events read in total (16281ms).
[00:42:14.960] <TB2> INFO: Expecting 655360 events.
[00:42:31.724] <TB2> INFO: 655360 events read in total (16362ms).
[00:42:31.781] <TB2> INFO: Expecting 655360 events.
[00:42:48.527] <TB2> INFO: 655360 events read in total (16345ms).
[00:42:48.637] <TB2> INFO: Test took 268546ms.
[00:42:48.717] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:42:48.946] <TB2> INFO: Expecting 655360 events.
[00:43:05.721] <TB2> INFO: 655360 events read in total (16219ms).
[00:43:05.730] <TB2> INFO: Expecting 655360 events.
[00:43:22.454] <TB2> INFO: 655360 events read in total (16322ms).
[00:43:22.466] <TB2> INFO: Expecting 655360 events.
[00:43:39.198] <TB2> INFO: 655360 events read in total (16330ms).
[00:43:39.216] <TB2> INFO: Expecting 655360 events.
[00:43:55.955] <TB2> INFO: 655360 events read in total (16337ms).
[00:43:55.974] <TB2> INFO: Expecting 655360 events.
[00:44:12.631] <TB2> INFO: 655360 events read in total (16255ms).
[00:44:12.653] <TB2> INFO: Expecting 655360 events.
[00:44:29.234] <TB2> INFO: 655360 events read in total (16179ms).
[00:44:29.259] <TB2> INFO: Expecting 655360 events.
[00:44:46.057] <TB2> INFO: 655360 events read in total (16396ms).
[00:44:46.087] <TB2> INFO: Expecting 655360 events.
[00:45:02.678] <TB2> INFO: 655360 events read in total (16189ms).
[00:45:02.712] <TB2> INFO: Expecting 655360 events.
[00:45:19.479] <TB2> INFO: 655360 events read in total (16365ms).
[00:45:19.522] <TB2> INFO: Expecting 655360 events.
[00:45:36.190] <TB2> INFO: 655360 events read in total (16267ms).
[00:45:36.230] <TB2> INFO: Expecting 655360 events.
[00:45:52.945] <TB2> INFO: 655360 events read in total (16314ms).
[00:45:52.988] <TB2> INFO: Expecting 655360 events.
[00:46:09.446] <TB2> INFO: 655360 events read in total (16057ms).
[00:46:09.497] <TB2> INFO: Expecting 655360 events.
[00:46:26.438] <TB2> INFO: 655360 events read in total (16539ms).
[00:46:26.486] <TB2> INFO: Expecting 655360 events.
[00:46:43.174] <TB2> INFO: 655360 events read in total (16286ms).
[00:46:43.226] <TB2> INFO: Expecting 655360 events.
[00:46:59.970] <TB2> INFO: 655360 events read in total (16342ms).
[00:47:00.031] <TB2> INFO: Expecting 655360 events.
[00:47:16.769] <TB2> INFO: 655360 events read in total (16336ms).
[00:47:16.830] <TB2> INFO: Test took 268113ms.
[00:47:17.021] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.029] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.036] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.043] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.050] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.057] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.063] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.070] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.077] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.084] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.091] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.098] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.104] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.111] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.118] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.125] <TB2> INFO: safety margin for low PH: adding 1, margin is now 21
[00:47:17.132] <TB2> INFO: safety margin for low PH: adding 0, margin is now 20
[00:47:17.140] <TB2> INFO: safety margin for low PH: adding 1, margin is now 21
[00:47:17.146] <TB2> INFO: safety margin for low PH: adding 2, margin is now 22
[00:47:17.154] <TB2> INFO: safety margin for low PH: adding 3, margin is now 23
[00:47:17.162] <TB2> INFO: safety margin for low PH: adding 4, margin is now 24
[00:47:17.205] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C0.dat
[00:47:17.205] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C1.dat
[00:47:17.206] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C2.dat
[00:47:17.206] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C3.dat
[00:47:17.206] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C4.dat
[00:47:17.207] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C5.dat
[00:47:17.207] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C6.dat
[00:47:17.217] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C7.dat
[00:47:17.217] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C8.dat
[00:47:17.218] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C9.dat
[00:47:17.218] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C10.dat
[00:47:17.218] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C11.dat
[00:47:17.218] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C12.dat
[00:47:17.218] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C13.dat
[00:47:17.219] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C14.dat
[00:47:17.219] <TB2> INFO: write dac parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//dacParameters35_C15.dat
[00:47:17.494] <TB2> INFO: Expecting 41600 events.
[00:47:20.964] <TB2> INFO: 41600 events read in total (2914ms).
[00:47:20.965] <TB2> INFO: Test took 3741ms.
[00:47:21.419] <TB2> INFO: Expecting 41600 events.
[00:47:24.905] <TB2> INFO: 41600 events read in total (2930ms).
[00:47:24.906] <TB2> INFO: Test took 3764ms.
[00:47:25.355] <TB2> INFO: Expecting 41600 events.
[00:47:28.825] <TB2> INFO: 41600 events read in total (2914ms).
[00:47:28.826] <TB2> INFO: Test took 3740ms.
[00:47:29.007] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:29.096] <TB2> INFO: Expecting 2560 events.
[00:47:29.952] <TB2> INFO: 2560 events read in total (300ms).
[00:47:29.952] <TB2> INFO: Test took 945ms.
[00:47:29.955] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:30.256] <TB2> INFO: Expecting 2560 events.
[00:47:31.110] <TB2> INFO: 2560 events read in total (297ms).
[00:47:31.110] <TB2> INFO: Test took 1155ms.
[00:47:31.112] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:31.416] <TB2> INFO: Expecting 2560 events.
[00:47:32.272] <TB2> INFO: 2560 events read in total (299ms).
[00:47:32.272] <TB2> INFO: Test took 1160ms.
[00:47:32.275] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:32.577] <TB2> INFO: Expecting 2560 events.
[00:47:33.433] <TB2> INFO: 2560 events read in total (299ms).
[00:47:33.433] <TB2> INFO: Test took 1158ms.
[00:47:33.434] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:33.739] <TB2> INFO: Expecting 2560 events.
[00:47:34.593] <TB2> INFO: 2560 events read in total (298ms).
[00:47:34.593] <TB2> INFO: Test took 1159ms.
[00:47:34.596] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:34.898] <TB2> INFO: Expecting 2560 events.
[00:47:35.757] <TB2> INFO: 2560 events read in total (302ms).
[00:47:35.758] <TB2> INFO: Test took 1162ms.
[00:47:35.761] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:36.063] <TB2> INFO: Expecting 2560 events.
[00:47:36.921] <TB2> INFO: 2560 events read in total (302ms).
[00:47:36.921] <TB2> INFO: Test took 1160ms.
[00:47:36.924] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:37.227] <TB2> INFO: Expecting 2560 events.
[00:47:38.081] <TB2> INFO: 2560 events read in total (298ms).
[00:47:38.081] <TB2> INFO: Test took 1157ms.
[00:47:38.084] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:38.386] <TB2> INFO: Expecting 2560 events.
[00:47:39.239] <TB2> INFO: 2560 events read in total (297ms).
[00:47:39.240] <TB2> INFO: Test took 1156ms.
[00:47:39.241] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:39.546] <TB2> INFO: Expecting 2560 events.
[00:47:40.399] <TB2> INFO: 2560 events read in total (297ms).
[00:47:40.400] <TB2> INFO: Test took 1159ms.
[00:47:40.401] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:40.706] <TB2> INFO: Expecting 2560 events.
[00:47:41.559] <TB2> INFO: 2560 events read in total (297ms).
[00:47:41.559] <TB2> INFO: Test took 1158ms.
[00:47:41.561] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:41.865] <TB2> INFO: Expecting 2560 events.
[00:47:42.717] <TB2> INFO: 2560 events read in total (296ms).
[00:47:42.717] <TB2> INFO: Test took 1156ms.
[00:47:42.719] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:43.023] <TB2> INFO: Expecting 2560 events.
[00:47:43.875] <TB2> INFO: 2560 events read in total (296ms).
[00:47:43.875] <TB2> INFO: Test took 1156ms.
[00:47:43.876] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:44.180] <TB2> INFO: Expecting 2560 events.
[00:47:45.033] <TB2> INFO: 2560 events read in total (297ms).
[00:47:45.033] <TB2> INFO: Test took 1157ms.
[00:47:45.034] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:45.338] <TB2> INFO: Expecting 2560 events.
[00:47:46.191] <TB2> INFO: 2560 events read in total (297ms).
[00:47:46.191] <TB2> INFO: Test took 1157ms.
[00:47:46.193] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:46.496] <TB2> INFO: Expecting 2560 events.
[00:47:47.349] <TB2> INFO: 2560 events read in total (296ms).
[00:47:47.349] <TB2> INFO: Test took 1156ms.
[00:47:47.351] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:47.654] <TB2> INFO: Expecting 2560 events.
[00:47:48.508] <TB2> INFO: 2560 events read in total (297ms).
[00:47:48.508] <TB2> INFO: Test took 1157ms.
[00:47:48.510] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:48.813] <TB2> INFO: Expecting 2560 events.
[00:47:49.666] <TB2> INFO: 2560 events read in total (297ms).
[00:47:49.666] <TB2> INFO: Test took 1156ms.
[00:47:49.669] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:49.972] <TB2> INFO: Expecting 2560 events.
[00:47:50.825] <TB2> INFO: 2560 events read in total (297ms).
[00:47:50.825] <TB2> INFO: Test took 1156ms.
[00:47:50.827] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:51.130] <TB2> INFO: Expecting 2560 events.
[00:47:51.984] <TB2> INFO: 2560 events read in total (298ms).
[00:47:51.984] <TB2> INFO: Test took 1157ms.
[00:47:51.986] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:52.289] <TB2> INFO: Expecting 2560 events.
[00:47:53.143] <TB2> INFO: 2560 events read in total (297ms).
[00:47:53.143] <TB2> INFO: Test took 1157ms.
[00:47:53.144] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:53.448] <TB2> INFO: Expecting 2560 events.
[00:47:54.302] <TB2> INFO: 2560 events read in total (298ms).
[00:47:54.302] <TB2> INFO: Test took 1158ms.
[00:47:54.304] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:54.608] <TB2> INFO: Expecting 2560 events.
[00:47:55.460] <TB2> INFO: 2560 events read in total (296ms).
[00:47:55.461] <TB2> INFO: Test took 1157ms.
[00:47:55.463] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:55.766] <TB2> INFO: Expecting 2560 events.
[00:47:56.619] <TB2> INFO: 2560 events read in total (297ms).
[00:47:56.619] <TB2> INFO: Test took 1156ms.
[00:47:56.622] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:56.925] <TB2> INFO: Expecting 2560 events.
[00:47:57.778] <TB2> INFO: 2560 events read in total (297ms).
[00:47:57.779] <TB2> INFO: Test took 1157ms.
[00:47:57.780] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:58.084] <TB2> INFO: Expecting 2560 events.
[00:47:58.936] <TB2> INFO: 2560 events read in total (296ms).
[00:47:58.936] <TB2> INFO: Test took 1156ms.
[00:47:58.939] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:47:59.242] <TB2> INFO: Expecting 2560 events.
[00:48:00.096] <TB2> INFO: 2560 events read in total (298ms).
[00:48:00.097] <TB2> INFO: Test took 1158ms.
[00:48:00.100] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:48:00.402] <TB2> INFO: Expecting 2560 events.
[00:48:01.254] <TB2> INFO: 2560 events read in total (296ms).
[00:48:01.254] <TB2> INFO: Test took 1154ms.
[00:48:01.257] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:48:01.560] <TB2> INFO: Expecting 2560 events.
[00:48:02.413] <TB2> INFO: 2560 events read in total (297ms).
[00:48:02.413] <TB2> INFO: Test took 1156ms.
[00:48:02.416] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:48:02.719] <TB2> INFO: Expecting 2560 events.
[00:48:03.575] <TB2> INFO: 2560 events read in total (300ms).
[00:48:03.575] <TB2> INFO: Test took 1159ms.
[00:48:03.578] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:48:03.881] <TB2> INFO: Expecting 2560 events.
[00:48:04.734] <TB2> INFO: 2560 events read in total (297ms).
[00:48:04.734] <TB2> INFO: Test took 1156ms.
[00:48:04.736] <TB2> INFO: Not all ROCs have their pixels configured the same way. Running in FLAG_FORCE_SERIAL mode.
[00:48:05.040] <TB2> INFO: Expecting 2560 events.
[00:48:05.892] <TB2> INFO: 2560 events read in total (296ms).
[00:48:05.893] <TB2> INFO: Test took 1157ms.
[00:48:06.347] <TB2> INFO: PixTestPhOptimization::doTest() done, duration: 617 seconds
[00:48:06.348] <TB2> INFO: PH scale (per ROC): 85 81 71 85 73 79 80 86 90 90 81 86 76 85 80 76
[00:48:06.348] <TB2> INFO: PH offset (per ROC): 157 178 163 160 165 175 158 157 149 145 166 164 167 160 158 176
[00:48:06.352] <TB2> INFO: Decoding statistics:
[00:48:06.352] <TB2> INFO: General information:
[00:48:06.352] <TB2> INFO: 16bit words read: 91916
[00:48:06.352] <TB2> INFO: valid events total: 10240
[00:48:06.352] <TB2> INFO: empty events: 7741
[00:48:06.352] <TB2> INFO: valid events with pixels: 2499
[00:48:06.352] <TB2> INFO: valid pixel hits: 2499
[00:48:06.352] <TB2> INFO: Event errors: 0
[00:48:06.352] <TB2> INFO: start marker: 0
[00:48:06.352] <TB2> INFO: stop marker: 0
[00:48:06.352] <TB2> INFO: overflow: 0
[00:48:06.352] <TB2> INFO: invalid 5bit words: 0
[00:48:06.352] <TB2> INFO: invalid XOR eye diagram: 0
[00:48:06.352] <TB2> INFO: frame (failed synchr.): 0
[00:48:06.352] <TB2> INFO: idle data (no TBM trl): 0
[00:48:06.352] <TB2> INFO: no data (only TBM hdr): 0
[00:48:06.352] <TB2> INFO: TBM errors: 0
[00:48:06.352] <TB2> INFO: flawed TBM headers: 0
[00:48:06.352] <TB2> INFO: flawed TBM trailers: 0
[00:48:06.352] <TB2> INFO: event ID mismatches: 0
[00:48:06.352] <TB2> INFO: ROC errors: 0
[00:48:06.352] <TB2> INFO: missing ROC header(s): 0
[00:48:06.352] <TB2> INFO: misplaced readback start: 0
[00:48:06.352] <TB2> INFO: Pixel decoding errors: 0
[00:48:06.352] <TB2> INFO: pixel data incomplete: 0
[00:48:06.352] <TB2> INFO: pixel address: 0
[00:48:06.352] <TB2> INFO: pulse height fill bit: 0
[00:48:06.352] <TB2> INFO: buffer corruption: 0
[00:48:06.576] <TB2> INFO: ######################################################################
[00:48:06.576] <TB2> INFO: PixTestGainPedestal::fullTest() ntrig = 10
[00:48:06.576] <TB2> INFO: ######################################################################
[00:48:06.590] <TB2> INFO: scanning low vcal = 10
[00:48:06.880] <TB2> INFO: Expecting 41600 events.
[00:48:10.403] <TB2> INFO: 41600 events read in total (2967ms).
[00:48:10.403] <TB2> INFO: Test took 3813ms.
[00:48:10.405] <TB2> INFO: scanning low vcal = 20
[00:48:10.709] <TB2> INFO: Expecting 41600 events.
[00:48:14.246] <TB2> INFO: 41600 events read in total (2981ms).
[00:48:14.246] <TB2> INFO: Test took 3841ms.
[00:48:14.248] <TB2> INFO: scanning low vcal = 30
[00:48:14.552] <TB2> INFO: Expecting 41600 events.
[00:48:18.111] <TB2> INFO: 41600 events read in total (3003ms).
[00:48:18.111] <TB2> INFO: Test took 3863ms.
[00:48:18.113] <TB2> INFO: scanning low vcal = 40
[00:48:18.408] <TB2> INFO: Expecting 41600 events.
[00:48:22.543] <TB2> INFO: 41600 events read in total (3579ms).
[00:48:22.544] <TB2> INFO: Test took 4431ms.
[00:48:22.547] <TB2> INFO: scanning low vcal = 50
[00:48:22.819] <TB2> INFO: Expecting 41600 events.
[00:48:27.052] <TB2> INFO: 41600 events read in total (3677ms).
[00:48:27.052] <TB2> INFO: Test took 4505ms.
[00:48:27.055] <TB2> INFO: scanning low vcal = 60
[00:48:27.336] <TB2> INFO: Expecting 41600 events.
[00:48:31.524] <TB2> INFO: 41600 events read in total (3632ms).
[00:48:31.524] <TB2> INFO: Test took 4469ms.
[00:48:31.527] <TB2> INFO: scanning low vcal = 70
[00:48:31.797] <TB2> INFO: Expecting 41600 events.
[00:48:36.002] <TB2> INFO: 41600 events read in total (3649ms).
[00:48:36.002] <TB2> INFO: Test took 4475ms.
[00:48:36.005] <TB2> INFO: scanning low vcal = 80
[00:48:36.296] <TB2> INFO: Expecting 41600 events.
[00:48:40.477] <TB2> INFO: 41600 events read in total (3625ms).
[00:48:40.478] <TB2> INFO: Test took 4473ms.
[00:48:40.481] <TB2> INFO: scanning low vcal = 90
[00:48:40.748] <TB2> INFO: Expecting 41600 events.
[00:48:44.944] <TB2> INFO: 41600 events read in total (3640ms).
[00:48:44.945] <TB2> INFO: Test took 4464ms.
[00:48:44.948] <TB2> INFO: scanning low vcal = 100
[00:48:45.217] <TB2> INFO: Expecting 41600 events.
[00:48:49.405] <TB2> INFO: 41600 events read in total (3632ms).
[00:48:49.406] <TB2> INFO: Test took 4458ms.
[00:48:49.408] <TB2> INFO: scanning low vcal = 110
[00:48:49.688] <TB2> INFO: Expecting 41600 events.
[00:48:53.893] <TB2> INFO: 41600 events read in total (3648ms).
[00:48:53.894] <TB2> INFO: Test took 4485ms.
[00:48:53.897] <TB2> INFO: scanning low vcal = 120
[00:48:54.161] <TB2> INFO: Expecting 41600 events.
[00:48:58.413] <TB2> INFO: 41600 events read in total (3696ms).
[00:48:58.413] <TB2> INFO: Test took 4516ms.
[00:48:58.417] <TB2> INFO: scanning low vcal = 130
[00:48:58.687] <TB2> INFO: Expecting 41600 events.
[00:49:02.885] <TB2> INFO: 41600 events read in total (3642ms).
[00:49:02.886] <TB2> INFO: Test took 4469ms.
[00:49:02.889] <TB2> INFO: scanning low vcal = 140
[00:49:03.166] <TB2> INFO: Expecting 41600 events.
[00:49:07.405] <TB2> INFO: 41600 events read in total (3682ms).
[00:49:07.406] <TB2> INFO: Test took 4517ms.
[00:49:07.408] <TB2> INFO: scanning low vcal = 150
[00:49:07.676] <TB2> INFO: Expecting 41600 events.
[00:49:11.853] <TB2> INFO: 41600 events read in total (3621ms).
[00:49:11.854] <TB2> INFO: Test took 4446ms.
[00:49:11.857] <TB2> INFO: scanning low vcal = 160
[00:49:12.119] <TB2> INFO: Expecting 41600 events.
[00:49:16.326] <TB2> INFO: 41600 events read in total (3651ms).
[00:49:16.326] <TB2> INFO: Test took 4469ms.
[00:49:16.329] <TB2> INFO: scanning low vcal = 170
[00:49:16.589] <TB2> INFO: Expecting 41600 events.
[00:49:20.811] <TB2> INFO: 41600 events read in total (3666ms).
[00:49:20.812] <TB2> INFO: Test took 4483ms.
[00:49:20.816] <TB2> INFO: scanning low vcal = 180
[00:49:21.077] <TB2> INFO: Expecting 41600 events.
[00:49:25.316] <TB2> INFO: 41600 events read in total (3683ms).
[00:49:25.317] <TB2> INFO: Test took 4501ms.
[00:49:25.319] <TB2> INFO: scanning low vcal = 190
[00:49:25.580] <TB2> INFO: Expecting 41600 events.
[00:49:29.822] <TB2> INFO: 41600 events read in total (3686ms).
[00:49:29.823] <TB2> INFO: Test took 4503ms.
[00:49:29.831] <TB2> INFO: scanning low vcal = 200
[00:49:30.122] <TB2> INFO: Expecting 41600 events.
[00:49:34.354] <TB2> INFO: 41600 events read in total (3676ms).
[00:49:34.355] <TB2> INFO: Test took 4524ms.
[00:49:34.357] <TB2> INFO: scanning low vcal = 210
[00:49:34.621] <TB2> INFO: Expecting 41600 events.
[00:49:38.829] <TB2> INFO: 41600 events read in total (3652ms).
[00:49:38.829] <TB2> INFO: Test took 4472ms.
[00:49:38.832] <TB2> INFO: scanning low vcal = 220
[00:49:39.122] <TB2> INFO: Expecting 41600 events.
[00:49:43.345] <TB2> INFO: 41600 events read in total (3666ms).
[00:49:43.346] <TB2> INFO: Test took 4514ms.
[00:49:43.348] <TB2> INFO: scanning low vcal = 230
[00:49:43.610] <TB2> INFO: Expecting 41600 events.
[00:49:47.823] <TB2> INFO: 41600 events read in total (3657ms).
[00:49:47.823] <TB2> INFO: Test took 4475ms.
[00:49:47.826] <TB2> INFO: scanning low vcal = 240
[00:49:48.102] <TB2> INFO: Expecting 41600 events.
[00:49:52.317] <TB2> INFO: 41600 events read in total (3659ms).
[00:49:52.317] <TB2> INFO: Test took 4491ms.
[00:49:52.320] <TB2> INFO: scanning low vcal = 250
[00:49:52.585] <TB2> INFO: Expecting 41600 events.
[00:49:56.781] <TB2> INFO: 41600 events read in total (3640ms).
[00:49:56.782] <TB2> INFO: Test took 4462ms.
[00:49:56.786] <TB2> INFO: scanning high vcal = 30 (= 210 in low range)
[00:49:57.047] <TB2> INFO: Expecting 41600 events.
[00:50:01.311] <TB2> INFO: 41600 events read in total (3708ms).
[00:50:01.312] <TB2> INFO: Test took 4526ms.
[00:50:01.316] <TB2> INFO: scanning high vcal = 50 (= 350 in low range)
[00:50:01.583] <TB2> INFO: Expecting 41600 events.
[00:50:05.826] <TB2> INFO: 41600 events read in total (3687ms).
[00:50:05.826] <TB2> INFO: Test took 4510ms.
[00:50:05.829] <TB2> INFO: scanning high vcal = 70 (= 490 in low range)
[00:50:06.094] <TB2> INFO: Expecting 41600 events.
[00:50:10.342] <TB2> INFO: 41600 events read in total (3692ms).
[00:50:10.342] <TB2> INFO: Test took 4513ms.
[00:50:10.345] <TB2> INFO: scanning high vcal = 90 (= 630 in low range)
[00:50:10.619] <TB2> INFO: Expecting 41600 events.
[00:50:14.836] <TB2> INFO: 41600 events read in total (3660ms).
[00:50:14.837] <TB2> INFO: Test took 4491ms.
[00:50:14.839] <TB2> INFO: scanning high vcal = 200 (= 1400 in low range)
[00:50:15.138] <TB2> INFO: Expecting 41600 events.
[00:50:19.342] <TB2> INFO: 41600 events read in total (3648ms).
[00:50:19.343] <TB2> INFO: Test took 4503ms.
[00:50:19.848] <TB2> INFO: PixTestGainPedestal::measure() done
[00:50:53.354] <TB2> INFO: PixTestGainPedestal::fit() done
[00:50:53.354] <TB2> INFO: non-linearity mean: 0.957 0.958 0.959 0.958 0.959 0.960 0.954 0.954 0.949 0.961 0.957 0.958 0.958 0.957 0.958 0.960
[00:50:53.354] <TB2> INFO: non-linearity RMS: 0.005 0.007 0.006 0.005 0.006 0.006 0.006 0.006 0.007 0.005 0.006 0.006 0.005 0.006 0.005 0.005
[00:50:53.354] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C0.dat
[00:50:53.375] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C1.dat
[00:50:53.394] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C2.dat
[00:50:53.415] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C3.dat
[00:50:53.435] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C4.dat
[00:50:53.454] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C5.dat
[00:50:53.474] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C6.dat
[00:50:53.494] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C7.dat
[00:50:53.514] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C8.dat
[00:50:53.534] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C9.dat
[00:50:53.553] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C10.dat
[00:50:53.571] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C11.dat
[00:50:53.590] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C12.dat
[00:50:53.608] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C13.dat
[00:50:53.626] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C14.dat
[00:50:53.644] <TB2> INFO: write gain/ped parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//phCalibrationFitErr35_C15.dat
[00:50:53.662] <TB2> INFO: PixTestGainPedestal::fullTest() done, duration: 167 seconds
[00:50:53.662] <TB2> INFO: Decoding statistics:
[00:50:53.662] <TB2> INFO: General information:
[00:50:53.662] <TB2> INFO: 16bit words read: 2662400
[00:50:53.662] <TB2> INFO: valid events total: 166400
[00:50:53.662] <TB2> INFO: empty events: 0
[00:50:53.662] <TB2> INFO: valid events with pixels: 166400
[00:50:53.662] <TB2> INFO: valid pixel hits: 665551
[00:50:53.662] <TB2> INFO: Event errors: 0
[00:50:53.662] <TB2> INFO: start marker: 0
[00:50:53.662] <TB2> INFO: stop marker: 0
[00:50:53.662] <TB2> INFO: overflow: 0
[00:50:53.662] <TB2> INFO: invalid 5bit words: 0
[00:50:53.662] <TB2> INFO: invalid XOR eye diagram: 0
[00:50:53.662] <TB2> INFO: frame (failed synchr.): 0
[00:50:53.662] <TB2> INFO: idle data (no TBM trl): 0
[00:50:53.662] <TB2> INFO: no data (only TBM hdr): 0
[00:50:53.662] <TB2> INFO: TBM errors: 0
[00:50:53.662] <TB2> INFO: flawed TBM headers: 0
[00:50:53.662] <TB2> INFO: flawed TBM trailers: 0
[00:50:53.662] <TB2> INFO: event ID mismatches: 0
[00:50:53.662] <TB2> INFO: ROC errors: 0
[00:50:53.662] <TB2> INFO: missing ROC header(s): 0
[00:50:53.662] <TB2> INFO: misplaced readback start: 0
[00:50:53.662] <TB2> INFO: Pixel decoding errors: 0
[00:50:53.662] <TB2> INFO: pixel data incomplete: 0
[00:50:53.662] <TB2> INFO: pixel address: 0
[00:50:53.662] <TB2> INFO: pulse height fill bit: 0
[00:50:53.663] <TB2> INFO: buffer corruption: 0
[00:50:53.670] <TB2> INFO: readReadbackCal: /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C0.dat .. /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C15.dat
[00:50:53.671] <TB2> INFO: ######################################################################
[00:50:53.671] <TB2> INFO: PixTestReadback::doTest()
[00:50:53.671] <TB2> INFO: ######################################################################
[00:50:53.671] <TB2> INFO: ----------------------------------------------------------------------
[00:50:53.671] <TB2> INFO: PixTestReadback::CalibrateVd()
[00:50:53.671] <TB2> INFO: ----------------------------------------------------------------------
[00:51:03.160] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C0.dat
[00:51:03.160] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C1.dat
[00:51:03.160] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C2.dat
[00:51:03.160] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C3.dat
[00:51:03.160] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C4.dat
[00:51:03.160] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C5.dat
[00:51:03.160] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C6.dat
[00:51:03.160] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C7.dat
[00:51:03.160] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C8.dat
[00:51:03.160] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C9.dat
[00:51:03.160] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C10.dat
[00:51:03.160] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C11.dat
[00:51:03.161] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C12.dat
[00:51:03.161] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C13.dat
[00:51:03.161] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C14.dat
[00:51:03.161] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C15.dat
[00:51:03.189] <TB2> INFO: PixTestPattern:: pg_setup set to default.
[00:51:03.189] <TB2> INFO: ----------------------------------------------------------------------
[00:51:03.189] <TB2> INFO: PixTestReadback::CalibrateVa()
[00:51:03.189] <TB2> INFO: ----------------------------------------------------------------------
[00:51:12.689] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C0.dat
[00:51:12.689] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C1.dat
[00:51:12.689] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C2.dat
[00:51:12.689] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C3.dat
[00:51:12.689] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C4.dat
[00:51:12.690] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C5.dat
[00:51:12.690] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C6.dat
[00:51:12.690] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C7.dat
[00:51:12.690] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C8.dat
[00:51:12.690] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C9.dat
[00:51:12.690] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C10.dat
[00:51:12.690] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C11.dat
[00:51:12.690] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C12.dat
[00:51:12.690] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C13.dat
[00:51:12.690] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C14.dat
[00:51:12.690] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C15.dat
[00:51:12.712] <TB2> INFO: PixTestPattern:: pg_setup set to default.
[00:51:12.712] <TB2> INFO: ----------------------------------------------------------------------
[00:51:12.712] <TB2> INFO: PixTestReadback::readbackVbg()
[00:51:12.712] <TB2> INFO: ----------------------------------------------------------------------
[00:51:20.015] <TB2> INFO: PixTestPattern:: pg_setup set to default.
[00:51:20.015] <TB2> INFO: ----------------------------------------------------------------------
[00:51:20.015] <TB2> INFO: PixTestReadback::getCalibratedVbg()
[00:51:20.015] <TB2> INFO: ----------------------------------------------------------------------
[00:51:20.015] <TB2> INFO: Vbg will be calibrated using Vd calibration
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 0: uncalibrated Vbg = 146.6calibrated Vbg = 1.18254 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 1: uncalibrated Vbg = 152.1calibrated Vbg = 1.18654 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 2: uncalibrated Vbg = 155.6calibrated Vbg = 1.19487 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 3: uncalibrated Vbg = 158.4calibrated Vbg = 1.18843 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 4: uncalibrated Vbg = 160.7calibrated Vbg = 1.19806 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 5: uncalibrated Vbg = 160.9calibrated Vbg = 1.20279 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 6: uncalibrated Vbg = 162.2calibrated Vbg = 1.20551 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 7: uncalibrated Vbg = 141.1calibrated Vbg = 1.20855 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 8: uncalibrated Vbg = 141.4calibrated Vbg = 1.20291 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 9: uncalibrated Vbg = 148calibrated Vbg = 1.20114 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 10: uncalibrated Vbg = 156.3calibrated Vbg = 1.19746 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 11: uncalibrated Vbg = 162.1calibrated Vbg = 1.19759 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 12: uncalibrated Vbg = 155.1calibrated Vbg = 1.19527 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 13: uncalibrated Vbg = 151.5calibrated Vbg = 1.19173 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 14: uncalibrated Vbg = 154.8calibrated Vbg = 1.18966 :::*/*/*/*/
[00:51:20.015] <TB2> INFO: /*/*/*/*::: ROC 15: uncalibrated Vbg = 157.7calibrated Vbg = 1.2004 :::*/*/*/*/
[00:51:20.018] <TB2> INFO: ----------------------------------------------------------------------
[00:51:20.018] <TB2> INFO: PixTestReadback::CalibrateIa()
[00:51:20.018] <TB2> INFO: ----------------------------------------------------------------------
[00:53:55.368] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C0.dat
[00:53:55.368] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C1.dat
[00:53:55.368] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C2.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C3.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C4.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C5.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C6.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C7.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C8.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C9.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C10.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C11.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C12.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C13.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C14.dat
[00:53:55.369] <TB2> INFO: write readback calibration parameters into /usr/local/coldboxDATA/M2220_FullQualification_2016-05-03_21h58m_1462305520//002_FulltestPxar_m20//readbackCal_C15.dat
[00:53:55.404] <TB2> INFO: PixTestPattern:: pg_setup set to default.
[00:53:55.405] <TB2> INFO: PixTestReadback::doTest() done
[00:53:55.405] <TB2> INFO: Decoding statistics:
[00:53:55.405] <TB2> INFO: General information:
[00:53:55.405] <TB2> INFO: 16bit words read: 1024
[00:53:55.405] <TB2> INFO: valid events total: 128
[00:53:55.405] <TB2> INFO: empty events: 128
[00:53:55.405] <TB2> INFO: valid events with pixels: 0
[00:53:55.406] <TB2> INFO: valid pixel hits: 0
[00:53:55.406] <TB2> INFO: Event errors: 0
[00:53:55.406] <TB2> INFO: start marker: 0
[00:53:55.406] <TB2> INFO: stop marker: 0
[00:53:55.406] <TB2> INFO: overflow: 0
[00:53:55.406] <TB2> INFO: invalid 5bit words: 0
[00:53:55.406] <TB2> INFO: invalid XOR eye diagram: 0
[00:53:55.406] <TB2> INFO: frame (failed synchr.): 0
[00:53:55.406] <TB2> INFO: idle data (no TBM trl): 0
[00:53:55.406] <TB2> INFO: no data (only TBM hdr): 0
[00:53:55.406] <TB2> INFO: TBM errors: 0
[00:53:55.406] <TB2> INFO: flawed TBM headers: 0
[00:53:55.406] <TB2> INFO: flawed TBM trailers: 0
[00:53:55.406] <TB2> INFO: event ID mismatches: 0
[00:53:55.406] <TB2> INFO: ROC errors: 0
[00:53:55.406] <TB2> INFO: missing ROC header(s): 0
[00:53:55.406] <TB2> INFO: misplaced readback start: 0
[00:53:55.406] <TB2> INFO: Pixel decoding errors: 0
[00:53:55.406] <TB2> INFO: pixel data incomplete: 0
[00:53:55.406] <TB2> INFO: pixel address: 0
[00:53:55.406] <TB2> INFO: pulse height fill bit: 0
[00:53:55.406] <TB2> INFO: buffer corruption: 0
[00:53:55.431] <TB2> INFO: Decoding statistics:
[00:53:55.431] <TB2> INFO: General information:
[00:53:55.431] <TB2> INFO: 16bit words read: 2755340
[00:53:55.431] <TB2> INFO: valid events total: 176768
[00:53:55.432] <TB2> INFO: empty events: 7869
[00:53:55.432] <TB2> INFO: valid events with pixels: 168899
[00:53:55.432] <TB2> INFO: valid pixel hits: 668050
[00:53:55.432] <TB2> INFO: Event errors: 0
[00:53:55.432] <TB2> INFO: start marker: 0
[00:53:55.432] <TB2> INFO: stop marker: 0
[00:53:55.432] <TB2> INFO: overflow: 0
[00:53:55.432] <TB2> INFO: invalid 5bit words: 0
[00:53:55.432] <TB2> INFO: invalid XOR eye diagram: 0
[00:53:55.432] <TB2> INFO: frame (failed synchr.): 0
[00:53:55.432] <TB2> INFO: idle data (no TBM trl): 0
[00:53:55.432] <TB2> INFO: no data (only TBM hdr): 0
[00:53:55.432] <TB2> INFO: TBM errors: 0
[00:53:55.432] <TB2> INFO: flawed TBM headers: 0
[00:53:55.432] <TB2> INFO: flawed TBM trailers: 0
[00:53:55.432] <TB2> INFO: event ID mismatches: 0
[00:53:55.432] <TB2> INFO: ROC errors: 0
[00:53:55.432] <TB2> INFO: missing ROC header(s): 0
[00:53:55.432] <TB2> INFO: misplaced readback start: 0
[00:53:55.432] <TB2> INFO: Pixel decoding errors: 0
[00:53:55.432] <TB2> INFO: pixel data incomplete: 0
[00:53:55.432] <TB2> INFO: pixel address: 0
[00:53:55.432] <TB2> INFO: pulse height fill bit: 0
[00:53:55.432] <TB2> INFO: buffer corruption: 0
[00:53:55.432] <TB2> INFO: enter test to run
[00:53:55.432] <TB2> INFO: test: exit no parameter change
[00:53:55.572] <TB2> QUIET: Connection to board 156 closed.
[00:53:55.652] <TB2> INFO: pXar: this is the end, my friend
MoReWeb-v1.0.0-5-g82d9ff6 on branch psi46master