[13:44:19.980] INFO: *** Welcome to pxar ***
[13:44:19.980] INFO: *** Today: 2016/05/27
[13:44:20.003] INFO: *** Version: v1.9.0-805-geb36
[13:44:20.003] INFO: readRocDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/dacParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/dacParameters35_C15.dat
[13:44:20.004] INFO: readTbmDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/tbmParameters_C0a.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/tbmParameters_C0b.dat
[13:44:20.004] INFO: readMaskFile: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/defaultMaskFile.dat
[13:44:20.004] INFO: readTrimFile: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/trimParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/trimParameters35_C15.dat
[13:44:20.154] INFO: clk: 4
[13:44:20.154] INFO: ctr: 4
[13:44:20.154] INFO: sda: 19
[13:44:20.154] INFO: tin: 9
[13:44:20.154] INFO: level: 15
[13:44:20.154] INFO: triggerdelay: 0
[13:44:20.155] QUIET: Instanciating API for pxar v1.9.0+803~gf2ecfa7
[13:44:20.155] INFO: Log level: INFO
[13:44:20.165] QUIET: Connection to board DTB_WRPRHI opened.
[13:44:20.169] INFO: DTB startup information
--- DTB info------------------------------------------
Board id: 58
HW version: DTB1.2
FW version: 4.2
SW version: 4.5
USB id: DTB_WRPRHI
MAC address: 40D85511803A
Hostname: pixelDTB058
Comment:
------------------------------------------------------
[13:44:20.171] INFO: RPC call hashes of host and DTB match: 398089610
[13:44:21.771] INFO: DUT info:
[13:44:21.771] INFO: The DUT currently contains the following objects:
[13:44:21.771] INFO: 2 TBM Cores tbm08c (2 ON)
[13:44:21.771] INFO: TBM Core alpha (0): 7 registers set
[13:44:21.771] INFO: TBM Core beta (1): 7 registers set
[13:44:21.771] INFO: 16 ROCs psi46digv21respin (16 ON) with 4160 pixelConfigs
[13:44:21.771] INFO: ROC 0: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 1: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 2: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 3: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 4: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 5: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 6: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 7: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 8: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 9: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 10: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 11: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 12: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 13: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 14: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:21.771] INFO: ROC 15: 19 DACs set, Pixels: 0 masked, 0 active.
[13:44:22.368] INFO: PixTestCmd::init()
[13:44:22.377] INFO: readGainPedestalParameters /home/CMS_pixel/Testing/pxar_fermi/data/mo101/phCalibrationFitErr35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/phCalibrationFitErr35_C15.dat
[13:44:22.675] INFO: readReadbackCal: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/readbackCal_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/readbackCal_C15.dat
[13:44:45.470] INFO: ----------------------------------------------------------------------
[13:44:45.470] INFO: PixTestXray::doPhRun() fParRunSeconds = 60
[13:44:45.470] INFO: ----------------------------------------------------------------------
[13:44:46.442] INFO: PixTestXray::doPhRun start TriggerLoop with trigger frequency 100 kHz, period 405 and duration 60 seconds, fEventsMax = 6000000
[13:44:58.696] INFO: run duration 12 seconds, buffer almost full (81%), pausing triggers.
[13:45:29.619] INFO: Resuming triggers.
[13:45:41.877] INFO: run duration 24 seconds, buffer almost full (81%), pausing triggers.
[13:46:12.872] INFO: Resuming triggers.
[13:46:25.128] INFO: run duration 36 seconds, buffer almost full (81%), pausing triggers.
[13:46:56.328] INFO: Resuming triggers.
[13:47:08.589] INFO: run duration 48 seconds, buffer almost full (81%), pausing triggers.
[13:47:39.363] INFO: Resuming triggers.
[13:47:50.416] INFO: data taking finished, elapsed time: 60 seconds.
[13:48:18.122] INFO: PixTest:: pg_setup set to default.
[13:48:18.158] INFO: PixTestXray::doPhRun() done
[13:48:40.227] QUIET: Connection to board 58 closed.
[13:48:59.411] INFO: *** Welcome to pxar ***
[13:48:59.411] INFO: *** Today: 2016/05/27
[13:48:59.433] INFO: *** Version: v1.9.0-805-geb36
[13:48:59.433] INFO: readRocDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/dacParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/dacParameters35_C15.dat
[13:48:59.434] INFO: readTbmDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/tbmParameters_C0a.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/tbmParameters_C0b.dat
[13:48:59.434] INFO: readMaskFile: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/defaultMaskFile.dat
[13:48:59.435] INFO: readTrimFile: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/trimParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/trimParameters35_C15.dat
[13:48:59.583] INFO: clk: 4
[13:48:59.584] INFO: ctr: 4
[13:48:59.584] INFO: sda: 19
[13:48:59.584] INFO: tin: 9
[13:48:59.584] INFO: level: 15
[13:48:59.584] INFO: triggerdelay: 0
[13:48:59.584] QUIET: Instanciating API for pxar v1.9.0+803~gf2ecfa7
[13:48:59.584] INFO: Log level: INFO
[13:48:59.596] QUIET: Connection to board DTB_WRPRHI opened.
[13:48:59.599] INFO: DTB startup information
--- DTB info------------------------------------------
Board id: 58
HW version: DTB1.2
FW version: 4.2
SW version: 4.5
USB id: DTB_WRPRHI
MAC address: 40D85511803A
Hostname: pixelDTB058
Comment:
------------------------------------------------------
[13:48:59.602] INFO: RPC call hashes of host and DTB match: 398089610
[13:49:01.202] INFO: DUT info:
[13:49:01.202] INFO: The DUT currently contains the following objects:
[13:49:01.202] INFO: 2 TBM Cores tbm08c (2 ON)
[13:49:01.202] INFO: TBM Core alpha (0): 7 registers set
[13:49:01.202] INFO: TBM Core beta (1): 7 registers set
[13:49:01.202] INFO: 16 ROCs psi46digv21respin (16 ON) with 4160 pixelConfigs
[13:49:01.202] INFO: ROC 0: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 1: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 2: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 3: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 4: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 5: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 6: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 7: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 8: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 9: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 10: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 11: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 12: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 13: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 14: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.202] INFO: ROC 15: 19 DACs set, Pixels: 0 masked, 0 active.
[13:49:01.792] INFO: PixTestCmd::init()
[13:49:01.801] INFO: readGainPedestalParameters /home/CMS_pixel/Testing/pxar_fermi/data/mo101/phCalibrationFitErr35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/phCalibrationFitErr35_C15.dat
[13:49:02.097] INFO: readReadbackCal: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/readbackCal_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/readbackCal_C15.dat
[13:49:13.022] INFO: ----------------------------------------------------------------------
[13:49:13.022] INFO: PixTestXray::doPhRun() fParRunSeconds = 60
[13:49:13.022] INFO: ----------------------------------------------------------------------
[13:49:13.995] INFO: PixTestXray::doPhRun start TriggerLoop with trigger frequency 100 kHz, period 405 and duration 60 seconds, fEventsMax = 6000000
[13:49:21.551] INFO: run duration 7 seconds, buffer almost full (81%), pausing triggers.
[13:49:56.600] INFO: Resuming triggers.
[13:50:04.157] INFO: run duration 15 seconds, buffer almost full (81%), pausing triggers.
[13:50:39.185] INFO: Resuming triggers.
[13:50:46.741] INFO: run duration 22 seconds, buffer almost full (81%), pausing triggers.
[13:51:21.803] INFO: Resuming triggers.
[13:51:29.365] INFO: run duration 30 seconds, buffer almost full (81%), pausing triggers.
[13:52:04.433] INFO: Resuming triggers.
[13:52:11.993] INFO: run duration 37 seconds, buffer almost full (81%), pausing triggers.
[13:52:47.029] INFO: Resuming triggers.
[13:52:54.588] INFO: run duration 45 seconds, buffer almost full (81%), pausing triggers.
[13:53:29.694] INFO: Resuming triggers.
[13:53:37.253] INFO: run duration 52 seconds, buffer almost full (81%), pausing triggers.
[13:54:12.260] INFO: Resuming triggers.
[13:54:19.429] INFO: data taking finished, elapsed time: 60 seconds.
[13:54:52.785] INFO: PixTest:: pg_setup set to default.
[13:54:52.821] INFO: PixTestXray::doPhRun() done
[13:55:58.481] QUIET: Connection to board 58 closed.
[13:36:53.921] INFO: *** Welcome to pxar ***
[13:36:53.921] INFO: *** Today: 2016/05/27
[13:36:53.944] INFO: *** Version: v1.9.0-805-geb36
[13:36:53.944] INFO: readRocDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/dacParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/dacParameters35_C15.dat
[13:36:53.945] INFO: readTbmDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/tbmParameters_C0a.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/tbmParameters_C0b.dat
[13:36:53.945] INFO: readMaskFile: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/defaultMaskFile.dat
[13:36:53.945] INFO: readTrimFile: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/trimParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/trimParameters35_C15.dat
[13:36:54.093] INFO: clk: 4
[13:36:54.093] INFO: ctr: 4
[13:36:54.093] INFO: sda: 19
[13:36:54.093] INFO: tin: 9
[13:36:54.093] INFO: level: 15
[13:36:54.093] INFO: triggerdelay: 0
[13:36:54.093] QUIET: Instanciating API for pxar v1.9.0+803~gf2ecfa7
[13:36:54.093] INFO: Log level: INFO
[13:36:54.106] QUIET: Connection to board DTB_WRPRHI opened.
[13:36:54.109] INFO: DTB startup information
--- DTB info------------------------------------------
Board id: 58
HW version: DTB1.2
FW version: 4.2
SW version: 4.5
USB id: DTB_WRPRHI
MAC address: 40D85511803A
Hostname: pixelDTB058
Comment:
------------------------------------------------------
[13:36:54.112] INFO: RPC call hashes of host and DTB match: 398089610
[13:36:55.711] INFO: DUT info:
[13:36:55.711] INFO: The DUT currently contains the following objects:
[13:36:55.711] INFO: 2 TBM Cores tbm08c (2 ON)
[13:36:55.711] INFO: TBM Core alpha (0): 7 registers set
[13:36:55.711] INFO: TBM Core beta (1): 7 registers set
[13:36:55.711] INFO: 16 ROCs psi46digv21respin (16 ON) with 4160 pixelConfigs
[13:36:55.711] INFO: ROC 0: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.711] INFO: ROC 1: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.711] INFO: ROC 2: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.711] INFO: ROC 3: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.711] INFO: ROC 4: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.711] INFO: ROC 5: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.711] INFO: ROC 6: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.711] INFO: ROC 7: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.712] INFO: ROC 8: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.712] INFO: ROC 9: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.712] INFO: ROC 10: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.712] INFO: ROC 11: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.712] INFO: ROC 12: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.712] INFO: ROC 13: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.712] INFO: ROC 14: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:55.712] INFO: ROC 15: 19 DACs set, Pixels: 0 masked, 0 active.
[13:36:56.317] INFO: PixTestCmd::init()
[13:36:56.321] INFO: readGainPedestalParameters /home/CMS_pixel/Testing/pxar_fermi/data/mo101/phCalibrationFitErr35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/phCalibrationFitErr35_C15.dat
[13:36:56.618] INFO: readReadbackCal: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/readbackCal_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/readbackCal_C15.dat
[13:37:01.241] INFO: ######################################################################
[13:37:01.241] INFO: PixTestAlive::doTest()
[13:37:01.241] INFO: ######################################################################
[13:37:01.244] INFO: ----------------------------------------------------------------------
[13:37:01.244] INFO: PixTestAlive::aliveTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[13:37:01.244] INFO: ----------------------------------------------------------------------
[13:37:01.621] INFO: Expecting 41600 events.
[13:37:05.888] INFO: 41600 events read in total (3549ms).
[13:37:06.036] INFO: Test took 4790ms.
[13:37:06.045] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:37:06.315] INFO: PixTestAlive::aliveTest() done
[13:37:06.315] INFO: number of dead pixels (per ROC): 0 0 0 0 1 0 0 1 0 0 0 0 0 0 0 0
[13:37:06.338] INFO: ----------------------------------------------------------------------
[13:37:06.338] INFO: PixTestAlive::maskTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[13:37:06.338] INFO: ----------------------------------------------------------------------
[13:37:06.713] INFO: Expecting 41600 events.
[13:37:09.779] INFO: 41600 events read in total (2350ms).
[13:37:09.779] INFO: Test took 3439ms.
[13:37:09.779] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:37:09.779] INFO: mask vs. old pixelAlive PixelAlive_C0_V0 .. PixelAlive_C15_V0
[13:37:10.202] INFO: PixTestAlive::maskTest() done
[13:37:10.202] INFO: number of mask-defect pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[13:37:10.220] INFO: ----------------------------------------------------------------------
[13:37:10.220] INFO: PixTestAlive::addressDecodingTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[13:37:10.220] INFO: ----------------------------------------------------------------------
[13:37:10.596] INFO: Expecting 41600 events.
[13:37:14.834] INFO: 41600 events read in total (3522ms).
[13:37:14.836] INFO: Test took 4614ms.
[13:37:14.846] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:37:15.217] INFO: PixTestAlive::addressDecodingTest() done
[13:37:15.217] INFO: number of address-decoding pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[13:37:15.217] INFO: PixTestAlive::doTest() done, duration: 13 seconds
[13:37:45.062] INFO: ----------------------------------------------------------------------
[13:37:45.062] INFO: PixTestHighRate::calDelScan() ntrig = 10, vcal = 200
[13:37:45.062] INFO: ----------------------------------------------------------------------
[13:37:45.200] INFO: Expecting 768 events.
[13:37:46.333] INFO: 768 events read in total (418ms).
[13:37:46.333] INFO: Test took 1266ms.
[13:37:47.137] INFO: Expecting 41600 events.
[13:37:50.316] INFO: 41600 events read in total (2652ms).
[13:37:50.320] INFO: Test took 3981ms.
[13:37:50.396] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:37:51.098] INFO: Expecting 41600 events.
[13:37:54.400] INFO: 41600 events read in total (2775ms).
[13:37:54.404] INFO: Test took 3971ms.
[13:37:54.483] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:37:55.186] INFO: Expecting 41600 events.
[13:37:58.530] INFO: 41600 events read in total (2817ms).
[13:37:58.534] INFO: Test took 4013ms.
[13:37:58.611] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:37:59.315] INFO: Expecting 41600 events.
[13:38:02.673] INFO: 41600 events read in total (2831ms).
[13:38:02.676] INFO: Test took 4026ms.
[13:38:02.753] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:03.457] INFO: Expecting 41600 events.
[13:38:06.805] INFO: 41600 events read in total (2821ms).
[13:38:06.809] INFO: Test took 4017ms.
[13:38:06.886] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:07.591] INFO: Expecting 41600 events.
[13:38:10.947] INFO: 41600 events read in total (2829ms).
[13:38:10.950] INFO: Test took 4024ms.
[13:38:11.027] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:11.735] INFO: Expecting 41600 events.
[13:38:15.092] INFO: 41600 events read in total (2831ms).
[13:38:15.095] INFO: Test took 4030ms.
[13:38:15.173] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:15.877] INFO: Expecting 41600 events.
[13:38:19.234] INFO: 41600 events read in total (2830ms).
[13:38:19.238] INFO: Test took 4026ms.
[13:38:19.316] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:20.020] INFO: Expecting 41600 events.
[13:38:23.378] INFO: 41600 events read in total (2831ms).
[13:38:23.381] INFO: Test took 4026ms.
[13:38:23.460] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:24.164] INFO: Expecting 41600 events.
[13:38:27.516] INFO: 41600 events read in total (2825ms).
[13:38:27.520] INFO: Test took 4021ms.
[13:38:27.598] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:28.302] INFO: Expecting 41600 events.
[13:38:31.671] INFO: 41600 events read in total (2842ms).
[13:38:31.674] INFO: Test took 4037ms.
[13:38:31.751] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:32.455] INFO: Expecting 41600 events.
[13:38:35.817] INFO: 41600 events read in total (2835ms).
[13:38:35.820] INFO: Test took 4030ms.
[13:38:35.897] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:36.603] INFO: Expecting 41600 events.
[13:38:39.971] INFO: 41600 events read in total (2841ms).
[13:38:39.975] INFO: Test took 4039ms.
[13:38:40.052] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:40.757] INFO: Expecting 41600 events.
[13:38:44.124] INFO: 41600 events read in total (2841ms).
[13:38:44.128] INFO: Test took 4037ms.
[13:38:44.204] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:44.908] INFO: Expecting 41600 events.
[13:38:48.278] INFO: 41600 events read in total (2843ms).
[13:38:48.281] INFO: Test took 4038ms.
[13:38:48.358] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:49.063] INFO: Expecting 41600 events.
[13:38:52.424] INFO: 41600 events read in total (2835ms).
[13:38:52.428] INFO: Test took 4030ms.
[13:38:52.506] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:53.213] INFO: Expecting 41600 events.
[13:38:56.567] INFO: 41600 events read in total (2828ms).
[13:38:56.571] INFO: Test took 4024ms.
[13:38:56.647] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:38:57.351] INFO: Expecting 41600 events.
[13:39:00.713] INFO: 41600 events read in total (2835ms).
[13:39:00.716] INFO: Test took 4030ms.
[13:39:00.793] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:39:01.497] INFO: Expecting 41600 events.
[13:39:04.854] INFO: 41600 events read in total (2830ms).
[13:39:04.858] INFO: Test took 4026ms.
[13:39:04.934] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:39:05.639] INFO: Expecting 41600 events.
[13:39:08.879] INFO: 41600 events read in total (2713ms).
[13:39:08.882] INFO: Test took 3908ms.
[13:39:08.959] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:39:39.542] INFO: ----------------------------------------------------------------------
[13:39:39.542] INFO: PixTestHighRate::xPixelAlive() ntrig = 50, vcal = 200
[13:39:39.542] INFO: ----------------------------------------------------------------------
[13:39:40.222] INFO: Expecting 208000 events.
[13:39:52.909] INFO: 208000 events read in total (12160ms).
[13:39:52.921] INFO: Test took 13364ms.
[13:39:53.270] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:39:53.633] INFO: number of dead pixels (per ROC): 0 0 0 0 1 0 0 1 0 0 0 0 0 0 0 0
[13:39:53.633] INFO: number of red-efficiency pixels: 68 68 146 215 219 240 221 210 202 258 223 282 206 160 68 88
[13:39:53.633] INFO: number of X-ray hits detected: 76515 60632 100919 149861 159693 158008 152371 139304 135414 165905 160424 149100 150939 99252 58556 70555
[13:39:53.633] INFO: number of triggers sent (total per ROC): 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000
[13:39:53.633] INFO: number of Vcal hits detected: 207929 207929 207849 207774 207722 207753 207770 207732 207790 207729 207768 207703 207784 207837 207932 207910
[13:39:53.633] INFO: Vcal hit fiducial efficiency (%): 100.0 100.0 99.9 99.9 99.9 99.9 99.9 99.9 99.9 99.9 99.9 99.9 99.9 99.9 100.0 100.0
[13:39:53.633] INFO: Vcal hit overall efficiency (%): 100.0 100.0 99.9 99.9 99.9 99.9 99.9 99.9 99.9 99.9 99.9 99.9 99.9 99.9 100.0 100.0
[13:39:53.633] INFO: X-ray hit rate [MHz/cm2]: 22.4 17.8 29.6 43.9 46.8 46.3 44.7 40.8 39.7 48.6 47.0 43.7 44.2 29.1 17.2 20.7
[13:39:53.633] INFO: PixTestHighRate::doXPixelAlive() done
[13:39:53.678] INFO: PixTest:: pg_setup set to default.
[13:40:44.351] QUIET: Connection to board 58 closed.
[13:33:21.281] INFO: *** Welcome to pxar ***
[13:33:21.281] INFO: *** Today: 2016/05/27
[13:33:21.303] INFO: *** Version: v1.9.0-805-geb36
[13:33:21.303] INFO: readRocDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/dacParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/dacParameters35_C15.dat
[13:33:21.304] INFO: readTbmDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/tbmParameters_C0a.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/tbmParameters_C0b.dat
[13:33:21.304] INFO: readMaskFile: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/defaultMaskFile.dat
[13:33:21.304] INFO: readTrimFile: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/trimParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/trimParameters35_C15.dat
[13:33:21.454] INFO: clk: 4
[13:33:21.454] INFO: ctr: 4
[13:33:21.454] INFO: sda: 19
[13:33:21.454] INFO: tin: 9
[13:33:21.454] INFO: level: 15
[13:33:21.454] INFO: triggerdelay: 0
[13:33:21.454] QUIET: Instanciating API for pxar v1.9.0+803~gf2ecfa7
[13:33:21.454] INFO: Log level: INFO
[13:33:21.465] QUIET: Connection to board DTB_WRPRHI opened.
[13:33:21.468] INFO: DTB startup information
--- DTB info------------------------------------------
Board id: 58
HW version: DTB1.2
FW version: 4.2
SW version: 4.5
USB id: DTB_WRPRHI
MAC address: 40D85511803A
Hostname: pixelDTB058
Comment:
------------------------------------------------------
[13:33:21.471] INFO: RPC call hashes of host and DTB match: 398089610
[13:33:23.070] INFO: DUT info:
[13:33:23.070] INFO: The DUT currently contains the following objects:
[13:33:23.070] INFO: 2 TBM Cores tbm08c (2 ON)
[13:33:23.070] INFO: TBM Core alpha (0): 7 registers set
[13:33:23.070] INFO: TBM Core beta (1): 7 registers set
[13:33:23.070] INFO: 16 ROCs psi46digv21respin (16 ON) with 4160 pixelConfigs
[13:33:23.070] INFO: ROC 0: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.070] INFO: ROC 1: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.070] INFO: ROC 2: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.070] INFO: ROC 3: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.070] INFO: ROC 4: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.070] INFO: ROC 5: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.070] INFO: ROC 6: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.071] INFO: ROC 7: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.071] INFO: ROC 8: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.071] INFO: ROC 9: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.071] INFO: ROC 10: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.071] INFO: ROC 11: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.071] INFO: ROC 12: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.071] INFO: ROC 13: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.071] INFO: ROC 14: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.071] INFO: ROC 15: 19 DACs set, Pixels: 0 masked, 0 active.
[13:33:23.673] INFO: PixTestCmd::init()
[13:33:23.683] INFO: readGainPedestalParameters /home/CMS_pixel/Testing/pxar_fermi/data/mo101/phCalibrationFitErr35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/phCalibrationFitErr35_C15.dat
[13:33:23.991] INFO: readReadbackCal: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/readbackCal_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/readbackCal_C15.dat
[13:33:29.289] INFO: ######################################################################
[13:33:29.289] INFO: PixTestAlive::doTest()
[13:33:29.289] INFO: ######################################################################
[13:33:29.292] INFO: ----------------------------------------------------------------------
[13:33:29.292] INFO: PixTestAlive::aliveTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[13:33:29.292] INFO: ----------------------------------------------------------------------
[13:33:29.670] INFO: Expecting 41600 events.
[13:33:33.919] INFO: 41600 events read in total (3531ms).
[13:33:34.067] INFO: Test took 4772ms.
[13:33:34.077] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:33:34.346] INFO: PixTestAlive::aliveTest() done
[13:33:34.346] INFO: number of dead pixels (per ROC): 0 0 0 0 1 0 0 1 0 0 0 0 0 0 0 0
[13:33:34.369] INFO: ----------------------------------------------------------------------
[13:33:34.369] INFO: PixTestAlive::maskTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[13:33:34.369] INFO: ----------------------------------------------------------------------
[13:33:34.745] INFO: Expecting 41600 events.
[13:33:37.795] INFO: 41600 events read in total (2335ms).
[13:33:37.795] INFO: Test took 3424ms.
[13:33:37.796] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:33:37.796] INFO: mask vs. old pixelAlive PixelAlive_C0_V0 .. PixelAlive_C15_V0
[13:33:38.218] INFO: PixTestAlive::maskTest() done
[13:33:38.218] INFO: number of mask-defect pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[13:33:38.236] INFO: ----------------------------------------------------------------------
[13:33:38.236] INFO: PixTestAlive::addressDecodingTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[13:33:38.236] INFO: ----------------------------------------------------------------------
[13:33:38.612] INFO: Expecting 41600 events.
[13:33:42.849] INFO: 41600 events read in total (3522ms).
[13:33:42.851] INFO: Test took 4613ms.
[13:33:42.862] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:33:43.233] INFO: PixTestAlive::addressDecodingTest() done
[13:33:43.233] INFO: number of address-decoding pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[13:33:43.233] INFO: PixTestAlive::doTest() done, duration: 13 seconds
[13:34:17.789] INFO: ----------------------------------------------------------------------
[13:34:17.789] INFO: PixTestHighRate::calDelScan() ntrig = 10, vcal = 200
[13:34:17.789] INFO: ----------------------------------------------------------------------
[13:34:17.928] INFO: Expecting 768 events.
[13:34:19.060] INFO: 768 events read in total (417ms).
[13:34:19.060] INFO: Test took 1265ms.
[13:34:19.864] INFO: Expecting 41600 events.
[13:34:23.302] INFO: 41600 events read in total (2911ms).
[13:34:23.308] INFO: Test took 4242ms.
[13:34:23.428] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:34:24.146] INFO: Expecting 41600 events.
[13:34:27.688] INFO: 41600 events read in total (3015ms).
[13:34:27.692] INFO: Test took 4211ms.
[13:34:27.812] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:34:28.532] INFO: Expecting 41600 events.
[13:34:32.126] INFO: 41600 events read in total (3067ms).
[13:34:32.130] INFO: Test took 4263ms.
[13:34:32.251] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:34:32.971] INFO: Expecting 41600 events.
[13:34:36.573] INFO: 41600 events read in total (3076ms).
[13:34:36.578] INFO: Test took 4272ms.
[13:34:36.699] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:34:37.419] INFO: Expecting 41600 events.
[13:34:41.034] INFO: 41600 events read in total (3088ms).
[13:34:41.038] INFO: Test took 4283ms.
[13:34:41.158] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:34:41.878] INFO: Expecting 41600 events.
[13:34:45.488] INFO: 41600 events read in total (3083ms).
[13:34:45.493] INFO: Test took 4280ms.
[13:34:45.613] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:34:46.334] INFO: Expecting 41600 events.
[13:34:49.964] INFO: 41600 events read in total (3103ms).
[13:34:49.969] INFO: Test took 4300ms.
[13:34:50.089] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:34:50.810] INFO: Expecting 41600 events.
[13:34:54.457] INFO: 41600 events read in total (3120ms).
[13:34:54.462] INFO: Test took 4317ms.
[13:34:54.582] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:34:55.304] INFO: Expecting 41600 events.
[13:34:58.938] INFO: 41600 events read in total (3108ms).
[13:34:58.943] INFO: Test took 4304ms.
[13:34:59.062] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:34:59.784] INFO: Expecting 41600 events.
[13:35:03.413] INFO: 41600 events read in total (3103ms).
[13:35:03.418] INFO: Test took 4300ms.
[13:35:03.540] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:35:04.260] INFO: Expecting 41600 events.
[13:35:07.884] INFO: 41600 events read in total (3097ms).
[13:35:07.889] INFO: Test took 4294ms.
[13:35:08.012] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:35:08.732] INFO: Expecting 41600 events.
[13:35:12.364] INFO: 41600 events read in total (3105ms).
[13:35:12.369] INFO: Test took 4302ms.
[13:35:12.489] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:35:13.210] INFO: Expecting 41600 events.
[13:35:16.851] INFO: 41600 events read in total (3114ms).
[13:35:16.856] INFO: Test took 4311ms.
[13:35:16.977] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:35:17.698] INFO: Expecting 41600 events.
[13:35:21.326] INFO: 41600 events read in total (3101ms).
[13:35:21.331] INFO: Test took 4298ms.
[13:35:21.451] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:35:22.173] INFO: Expecting 41600 events.
[13:35:25.808] INFO: 41600 events read in total (3109ms).
[13:35:25.813] INFO: Test took 4305ms.
[13:35:25.935] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:35:26.657] INFO: Expecting 41600 events.
[13:35:30.282] INFO: 41600 events read in total (3099ms).
[13:35:30.287] INFO: Test took 4296ms.
[13:35:30.405] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:35:31.127] INFO: Expecting 41600 events.
[13:35:34.749] INFO: 41600 events read in total (3096ms).
[13:35:34.754] INFO: Test took 4292ms.
[13:35:34.875] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:35:35.597] INFO: Expecting 41600 events.
[13:35:39.215] INFO: 41600 events read in total (3092ms).
[13:35:39.219] INFO: Test took 4288ms.
[13:35:39.341] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:35:40.062] INFO: Expecting 41600 events.
[13:35:43.667] INFO: 41600 events read in total (3078ms).
[13:35:43.672] INFO: Test took 4275ms.
[13:35:43.795] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:35:44.517] INFO: Expecting 41600 events.
[13:35:48.015] INFO: 41600 events read in total (2972ms).
[13:35:48.020] INFO: Test took 4169ms.
[13:35:48.137] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:36:05.381] INFO: ----------------------------------------------------------------------
[13:36:05.381] INFO: PixTestHighRate::xPixelAlive() ntrig = 50, vcal = 200
[13:36:05.382] INFO: ----------------------------------------------------------------------
[13:36:06.063] INFO: Expecting 208000 events.
[13:36:20.585] INFO: 208000 events read in total (13995ms).
[13:36:20.604] INFO: Test took 15207ms.
[13:36:21.180] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:36:21.629] INFO: number of dead pixels (per ROC): 0 0 0 0 1 0 0 1 0 0 0 0 0 0 0 0
[13:36:21.629] INFO: number of red-efficiency pixels: 184 133 348 451 506 562 474 439 437 579 600 456 493 279 122 163
[13:36:21.629] INFO: number of X-ray hits detected: 125774 99286 165326 245161 260109 257532 250548 228566 220951 271090 262715 243859 246469 161736 95840 115302
[13:36:21.629] INFO: number of triggers sent (total per ROC): 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000
[13:36:21.629] INFO: number of Vcal hits detected: 207806 207863 207614 207517 207392 207367 207484 207482 207532 207367 207338 207504 207459 207698 207874 207834
[13:36:21.629] INFO: Vcal hit fiducial efficiency (%): 99.9 99.9 99.8 99.8 99.7 99.7 99.8 99.8 99.8 99.7 99.7 99.8 99.8 99.9 99.9 99.9
[13:36:21.629] INFO: Vcal hit overall efficiency (%): 99.9 99.9 99.8 99.8 99.7 99.7 99.8 99.8 99.8 99.7 99.7 99.8 99.7 99.9 99.9 99.9
[13:36:21.629] INFO: X-ray hit rate [MHz/cm2]: 36.9 29.1 48.5 71.9 76.2 75.5 73.4 67.0 64.8 79.5 77.0 71.5 72.2 47.4 28.1 33.8
[13:36:21.629] INFO: PixTestHighRate::doXPixelAlive() done
[13:36:21.675] INFO: PixTest:: pg_setup set to default.
[13:36:31.082] QUIET: Connection to board 58 closed.
[13:30:11.694] INFO: *** Welcome to pxar ***
[13:30:11.694] INFO: *** Today: 2016/05/27
[13:30:11.716] INFO: *** Version: v1.9.0-805-geb36
[13:30:11.716] INFO: readRocDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/dacParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/dacParameters35_C15.dat
[13:30:11.717] INFO: readTbmDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/tbmParameters_C0a.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/tbmParameters_C0b.dat
[13:30:11.717] INFO: readMaskFile: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/defaultMaskFile.dat
[13:30:11.717] INFO: readTrimFile: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/trimParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/trimParameters35_C15.dat
[13:30:11.869] INFO: clk: 4
[13:30:11.869] INFO: ctr: 4
[13:30:11.869] INFO: sda: 19
[13:30:11.869] INFO: tin: 9
[13:30:11.869] INFO: level: 15
[13:30:11.869] INFO: triggerdelay: 0
[13:30:11.869] QUIET: Instanciating API for pxar v1.9.0+803~gf2ecfa7
[13:30:11.869] INFO: Log level: INFO
[13:30:11.882] QUIET: Connection to board DTB_WRPRHI opened.
[13:30:11.885] INFO: DTB startup information
--- DTB info------------------------------------------
Board id: 58
HW version: DTB1.2
FW version: 4.2
SW version: 4.5
USB id: DTB_WRPRHI
MAC address: 40D85511803A
Hostname: pixelDTB058
Comment:
------------------------------------------------------
[13:30:11.888] INFO: RPC call hashes of host and DTB match: 398089610
[13:30:13.488] INFO: DUT info:
[13:30:13.488] INFO: The DUT currently contains the following objects:
[13:30:13.488] INFO: 2 TBM Cores tbm08c (2 ON)
[13:30:13.488] INFO: TBM Core alpha (0): 7 registers set
[13:30:13.488] INFO: TBM Core beta (1): 7 registers set
[13:30:13.488] INFO: 16 ROCs psi46digv21respin (16 ON) with 4160 pixelConfigs
[13:30:13.488] INFO: ROC 0: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 1: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 2: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 3: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 4: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 5: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 6: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 7: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 8: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 9: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 10: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 11: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 12: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 13: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 14: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:13.488] INFO: ROC 15: 19 DACs set, Pixels: 0 masked, 0 active.
[13:30:14.076] INFO: PixTestCmd::init()
[13:30:14.084] INFO: readGainPedestalParameters /home/CMS_pixel/Testing/pxar_fermi/data/mo101/phCalibrationFitErr35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/phCalibrationFitErr35_C15.dat
[13:30:14.387] INFO: readReadbackCal: /home/CMS_pixel/Testing/pxar_fermi/data/mo101/readbackCal_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mo101/readbackCal_C15.dat
[13:30:17.529] INFO: ######################################################################
[13:30:17.529] INFO: PixTestAlive::doTest()
[13:30:17.529] INFO: ######################################################################
[13:30:17.532] INFO: ----------------------------------------------------------------------
[13:30:17.532] INFO: PixTestAlive::aliveTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[13:30:17.532] INFO: ----------------------------------------------------------------------
[13:30:17.909] INFO: Expecting 41600 events.
[13:30:22.163] INFO: 41600 events read in total (3535ms).
[13:30:22.311] INFO: Test took 4776ms.
[13:30:22.320] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:30:22.590] INFO: PixTestAlive::aliveTest() done
[13:30:22.590] INFO: number of dead pixels (per ROC): 0 0 0 0 1 0 0 1 0 0 0 0 0 0 0 0
[13:30:22.613] INFO: ----------------------------------------------------------------------
[13:30:22.613] INFO: PixTestAlive::maskTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[13:30:22.613] INFO: ----------------------------------------------------------------------
[13:30:22.989] INFO: Expecting 41600 events.
[13:30:26.038] INFO: 41600 events read in total (2333ms).
[13:30:26.038] INFO: Test took 3422ms.
[13:30:26.038] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:30:26.039] INFO: mask vs. old pixelAlive PixelAlive_C0_V0 .. PixelAlive_C15_V0
[13:30:26.461] INFO: PixTestAlive::maskTest() done
[13:30:26.461] INFO: number of mask-defect pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[13:30:26.479] INFO: ----------------------------------------------------------------------
[13:30:26.479] INFO: PixTestAlive::addressDecodingTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[13:30:26.479] INFO: ----------------------------------------------------------------------
[13:30:26.855] INFO: Expecting 41600 events.
[13:30:31.115] INFO: 41600 events read in total (3545ms).
[13:30:31.116] INFO: Test took 4635ms.
[13:30:31.127] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:30:31.499] INFO: PixTestAlive::addressDecodingTest() done
[13:30:31.499] INFO: number of address-decoding pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[13:30:31.499] INFO: PixTestAlive::doTest() done, duration: 13 seconds
[13:30:35.765] INFO: ----------------------------------------------------------------------
[13:30:35.765] INFO: PixTestHighRate::calDelScan() ntrig = 10, vcal = 200
[13:30:35.766] INFO: ----------------------------------------------------------------------
[13:30:35.904] INFO: Expecting 768 events.
[13:30:37.036] INFO: 768 events read in total (417ms).
[13:30:37.036] INFO: Test took 1265ms.
[13:30:37.840] INFO: Expecting 41600 events.
[13:30:41.545] INFO: 41600 events read in total (3179ms).
[13:30:41.551] INFO: Test took 4509ms.
[13:30:41.715] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:30:42.449] INFO: Expecting 41600 events.
[13:30:46.265] INFO: 41600 events read in total (3289ms).
[13:30:46.270] INFO: Test took 4486ms.
[13:30:46.428] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:30:47.167] INFO: Expecting 41600 events.
[13:30:51.051] INFO: 41600 events read in total (3357ms).
[13:30:51.057] INFO: Test took 4555ms.
[13:30:51.216] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:30:51.951] INFO: Expecting 41600 events.
[13:30:55.866] INFO: 41600 events read in total (3389ms).
[13:30:55.872] INFO: Test took 4586ms.
[13:30:56.034] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:30:56.769] INFO: Expecting 41600 events.
[13:31:00.665] INFO: 41600 events read in total (3369ms).
[13:31:00.671] INFO: Test took 4567ms.
[13:31:00.830] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:01.565] INFO: Expecting 41600 events.
[13:31:05.477] INFO: 41600 events read in total (3385ms).
[13:31:05.483] INFO: Test took 4583ms.
[13:31:05.644] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:06.379] INFO: Expecting 41600 events.
[13:31:10.293] INFO: 41600 events read in total (3388ms).
[13:31:10.299] INFO: Test took 4585ms.
[13:31:10.459] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:11.196] INFO: Expecting 41600 events.
[13:31:15.091] INFO: 41600 events read in total (3369ms).
[13:31:15.096] INFO: Test took 4565ms.
[13:31:15.256] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:15.991] INFO: Expecting 41600 events.
[13:31:19.906] INFO: 41600 events read in total (3388ms).
[13:31:19.912] INFO: Test took 4586ms.
[13:31:20.073] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:20.809] INFO: Expecting 41600 events.
[13:31:24.734] INFO: 41600 events read in total (3399ms).
[13:31:24.740] INFO: Test took 4596ms.
[13:31:24.900] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:25.635] INFO: Expecting 41600 events.
[13:31:29.569] INFO: 41600 events read in total (3408ms).
[13:31:29.574] INFO: Test took 4604ms.
[13:31:29.733] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:30.469] INFO: Expecting 41600 events.
[13:31:34.385] INFO: 41600 events read in total (3389ms).
[13:31:34.391] INFO: Test took 4587ms.
[13:31:34.552] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:35.288] INFO: Expecting 41600 events.
[13:31:39.205] INFO: 41600 events read in total (3390ms).
[13:31:39.211] INFO: Test took 4588ms.
[13:31:39.370] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:40.105] INFO: Expecting 41600 events.
[13:31:44.016] INFO: 41600 events read in total (3384ms).
[13:31:44.023] INFO: Test took 4583ms.
[13:31:44.183] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:44.918] INFO: Expecting 41600 events.
[13:31:48.851] INFO: 41600 events read in total (3405ms).
[13:31:48.857] INFO: Test took 4603ms.
[13:31:49.020] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:49.756] INFO: Expecting 41600 events.
[13:31:53.678] INFO: 41600 events read in total (3396ms).
[13:31:53.684] INFO: Test took 4593ms.
[13:31:53.844] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:54.579] INFO: Expecting 41600 events.
[13:31:58.500] INFO: 41600 events read in total (3394ms).
[13:31:58.506] INFO: Test took 4592ms.
[13:31:58.664] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:31:59.401] INFO: Expecting 41600 events.
[13:32:03.328] INFO: 41600 events read in total (3401ms).
[13:32:03.334] INFO: Test took 4599ms.
[13:32:03.495] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:32:04.231] INFO: Expecting 41600 events.
[13:32:08.139] INFO: 41600 events read in total (3382ms).
[13:32:08.146] INFO: Test took 4581ms.
[13:32:08.308] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:32:09.044] INFO: Expecting 41600 events.
[13:32:12.814] INFO: 41600 events read in total (3243ms).
[13:32:12.819] INFO: Test took 4439ms.
[13:32:12.971] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:32:28.765] INFO: ----------------------------------------------------------------------
[13:32:28.765] INFO: PixTestHighRate::xPixelAlive() ntrig = 50, vcal = 200
[13:32:28.765] INFO: ----------------------------------------------------------------------
[13:32:29.446] INFO: Expecting 208000 events.
[13:32:46.147] INFO: 208000 events read in total (16174ms).
[13:32:46.170] INFO: Test took 17389ms.
[13:32:46.971] INFO: Fetched DAQ statistics. Counters are being reset now.
[13:32:47.499] INFO: number of dead pixels (per ROC): 0 0 0 0 1 0 0 1 0 0 0 0 0 0 0 0
[13:32:47.499] INFO: number of red-efficiency pixels: 274 206 507 793 943 926 866 806 773 1079 1061 869 886 501 203 259
[13:32:47.499] INFO: number of X-ray hits detected: 171829 136511 226535 336936 356162 354048 344122 313710 303437 372435 360445 335562 337462 222587 131987 158724
[13:32:47.499] INFO: number of triggers sent (total per ROC): 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000
[13:32:47.499] INFO: number of Vcal hits detected: 207714 207779 207403 207079 206805 206920 206959 206974 207098 206645 206734 206967 206962 207431 207789 207732
[13:32:47.499] INFO: Vcal hit fiducial efficiency (%): 99.9 99.9 99.7 99.6 99.5 99.5 99.5 99.6 99.6 99.4 99.4 99.5 99.5 99.8 99.9 99.9
[13:32:47.499] INFO: Vcal hit overall efficiency (%): 99.9 99.9 99.7 99.6 99.4 99.5 99.5 99.5 99.6 99.3 99.4 99.5 99.5 99.7 99.9 99.9
[13:32:47.499] INFO: X-ray hit rate [MHz/cm2]: 50.4 40.0 66.4 98.8 104.4 103.8 100.9 92.0 88.9 109.2 105.6 98.4 98.9 65.2 38.7 46.5
[13:32:47.499] INFO: PixTestHighRate::doXPixelAlive() done
[13:32:47.545] INFO: PixTest:: pg_setup set to default.
[13:33:06.931] QUIET: Connection to board 58 closed.