[12:22:07.292] INFO: *** Welcome to pxar ***
[12:22:07.292] INFO: *** Today: 2016/06/01
[12:22:07.314] INFO: *** Version: v1.9.0-805-geb36
[12:22:07.315] INFO: readRocDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/dacParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/dacParameters35_C15.dat
[12:22:07.316] INFO: readTbmDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/tbmParameters_C0a.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/tbmParameters_C0b.dat
[12:22:07.316] INFO: readMaskFile: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/defaultMaskFile.dat
[12:22:07.316] INFO: readTrimFile: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/trimParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/trimParameters35_C15.dat
[12:22:07.464] INFO: clk: 4
[12:22:07.464] INFO: ctr: 4
[12:22:07.464] INFO: sda: 19
[12:22:07.464] INFO: tin: 9
[12:22:07.464] INFO: level: 15
[12:22:07.464] INFO: triggerdelay: 0
[12:22:07.464] QUIET: Instanciating API for pxar v1.9.0+803~gf2ecfa7
[12:22:07.464] INFO: Log level: INFO
[12:22:07.475] QUIET: Connection to board DTB_WRPRHI opened.
[12:22:07.478] 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:
------------------------------------------------------
[12:22:07.481] INFO: RPC call hashes of host and DTB match: 398089610
[12:22:09.082] INFO: DUT info:
[12:22:09.082] INFO: The DUT currently contains the following objects:
[12:22:09.082] INFO: 2 TBM Cores tbm08c (2 ON)
[12:22:09.082] INFO: TBM Core alpha (0): 7 registers set
[12:22:09.083] INFO: TBM Core beta (1): 7 registers set
[12:22:09.083] INFO: 16 ROCs psi46digv21respin (16 ON) with 4160 pixelConfigs
[12:22:09.083] INFO: ROC 0: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 1: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 2: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 3: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 4: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 5: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 6: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 7: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 8: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 9: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 10: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 11: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 12: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 13: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 14: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.083] INFO: ROC 15: 19 DACs set, Pixels: 0 masked, 0 active.
[12:22:09.715] INFO: PixTestCmd::init()
[12:22:09.726] INFO: readGainPedestalParameters /home/CMS_pixel/Testing/pxar_fermi/data/mi304/phCalibrationFitErr35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/phCalibrationFitErr35_C15.dat
[12:22:10.028] INFO: readReadbackCal: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/readbackCal_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/readbackCal_C15.dat
[12:22:18.749] INFO: ######################################################################
[12:22:18.749] INFO: PixTestXray::doTest()
[12:22:18.749] INFO: ######################################################################
[12:22:18.749] INFO: ----------------------------------------------------------------------
[12:22:18.749] INFO: PixTestXray::doPhRun() fParRunSeconds = 60
[12:22:18.749] INFO: ----------------------------------------------------------------------
[12:22:19.722] INFO: PixTestXray::doPhRun start TriggerLoop with trigger frequency 100 kHz, period 405 and duration 60 seconds, fEventsMax = 6000000
[12:22:32.006] INFO: run duration 12 seconds, buffer almost full (81%), pausing triggers.
[12:23:02.965] INFO: Resuming triggers.
[12:23:15.253] INFO: run duration 24 seconds, buffer almost full (81%), pausing triggers.
[12:23:46.503] INFO: Resuming triggers.
[12:23:58.794] INFO: run duration 36 seconds, buffer almost full (81%), pausing triggers.
[12:24:29.766] INFO: Resuming triggers.
[12:24:42.054] INFO: run duration 49 seconds, buffer almost full (81%), pausing triggers.
[12:25:12.979] INFO: Resuming triggers.
[12:25:23.907] INFO: data taking finished, elapsed time: 60 seconds.
[12:25:51.543] INFO: PixTest:: pg_setup set to default.
[12:25:51.580] INFO: PixTestXray::doPhRun() done
[12:25:51.580] INFO: PixTestXray::doTest() done
[12:26:26.786] QUIET: Connection to board 58 closed.
[12:26:36.941] INFO: *** Welcome to pxar ***
[12:26:36.941] INFO: *** Today: 2016/06/01
[12:26:36.964] INFO: *** Version: v1.9.0-805-geb36
[12:26:36.964] INFO: readRocDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/dacParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/dacParameters35_C15.dat
[12:26:36.965] INFO: readTbmDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/tbmParameters_C0a.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/tbmParameters_C0b.dat
[12:26:36.965] INFO: readMaskFile: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/defaultMaskFile.dat
[12:26:36.965] INFO: readTrimFile: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/trimParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/trimParameters35_C15.dat
[12:26:37.114] INFO: clk: 4
[12:26:37.114] INFO: ctr: 4
[12:26:37.114] INFO: sda: 19
[12:26:37.114] INFO: tin: 9
[12:26:37.114] INFO: level: 15
[12:26:37.114] INFO: triggerdelay: 0
[12:26:37.114] QUIET: Instanciating API for pxar v1.9.0+803~gf2ecfa7
[12:26:37.114] INFO: Log level: INFO
[12:26:37.125] QUIET: Connection to board DTB_WRPRHI opened.
[12:26:37.128] 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:
------------------------------------------------------
[12:26:37.131] INFO: RPC call hashes of host and DTB match: 398089610
[12:26:38.731] INFO: DUT info:
[12:26:38.731] INFO: The DUT currently contains the following objects:
[12:26:38.731] INFO: 2 TBM Cores tbm08c (2 ON)
[12:26:38.731] INFO: TBM Core alpha (0): 7 registers set
[12:26:38.731] INFO: TBM Core beta (1): 7 registers set
[12:26:38.731] INFO: 16 ROCs psi46digv21respin (16 ON) with 4160 pixelConfigs
[12:26:38.731] INFO: ROC 0: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 1: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 2: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 3: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 4: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 5: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 6: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 7: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 8: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 9: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 10: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 11: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 12: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 13: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 14: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:38.731] INFO: ROC 15: 19 DACs set, Pixels: 0 masked, 0 active.
[12:26:39.338] INFO: PixTestCmd::init()
[12:26:39.343] INFO: readGainPedestalParameters /home/CMS_pixel/Testing/pxar_fermi/data/mi304/phCalibrationFitErr35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/phCalibrationFitErr35_C15.dat
[12:26:39.646] INFO: readReadbackCal: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/readbackCal_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/readbackCal_C15.dat
[12:26:54.509] INFO: ######################################################################
[12:26:54.509] INFO: PixTestXray::doTest()
[12:26:54.509] INFO: ######################################################################
[12:26:54.509] INFO: ----------------------------------------------------------------------
[12:26:54.509] INFO: PixTestXray::doPhRun() fParRunSeconds = 60
[12:26:54.509] INFO: ----------------------------------------------------------------------
[12:26:55.482] INFO: PixTestXray::doPhRun start TriggerLoop with trigger frequency 100 kHz, period 405 and duration 60 seconds, fEventsMax = 6000000
[12:27:03.439] INFO: run duration 7 seconds, buffer almost full (81%), pausing triggers.
[12:27:38.155] INFO: Resuming triggers.
[12:27:46.120] INFO: run duration 15 seconds, buffer almost full (81%), pausing triggers.
[12:28:20.631] INFO: Resuming triggers.
[12:28:28.595] INFO: run duration 23 seconds, buffer almost full (81%), pausing triggers.
[12:29:02.502] INFO: Resuming triggers.
[12:29:10.465] INFO: run duration 31 seconds, buffer almost full (81%), pausing triggers.
[12:29:44.327] INFO: Resuming triggers.
[12:29:52.294] INFO: run duration 39 seconds, buffer almost full (81%), pausing triggers.
[12:30:25.986] INFO: Resuming triggers.
[12:30:33.953] INFO: run duration 47 seconds, buffer almost full (81%), pausing triggers.
[12:31:07.706] INFO: Resuming triggers.
[12:31:15.672] INFO: run duration 55 seconds, buffer almost full (81%), pausing triggers.
[12:31:49.337] INFO: Resuming triggers.
[12:31:53.667] INFO: data taking finished, elapsed time: 60 seconds.
[12:32:12.280] INFO: PixTest:: pg_setup set to default.
[12:32:12.317] INFO: PixTestXray::doPhRun() done
[12:32:12.317] INFO: PixTestXray::doTest() done
[12:32:40.866] QUIET: Connection to board 58 closed.
[12:15:43.697] INFO: *** Welcome to pxar ***
[12:15:43.697] INFO: *** Today: 2016/06/01
[12:15:43.719] INFO: *** Version: v1.9.0-805-geb36
[12:15:43.719] INFO: readRocDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/dacParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/dacParameters35_C15.dat
[12:15:43.720] INFO: readTbmDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/tbmParameters_C0a.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/tbmParameters_C0b.dat
[12:15:43.720] INFO: readMaskFile: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/defaultMaskFile.dat
[12:15:43.720] INFO: readTrimFile: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/trimParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/trimParameters35_C15.dat
[12:15:43.869] INFO: clk: 4
[12:15:43.869] INFO: ctr: 4
[12:15:43.869] INFO: sda: 19
[12:15:43.869] INFO: tin: 9
[12:15:43.869] INFO: level: 15
[12:15:43.869] INFO: triggerdelay: 0
[12:15:43.869] QUIET: Instanciating API for pxar v1.9.0+803~gf2ecfa7
[12:15:43.869] INFO: Log level: INFO
[12:15:43.880] QUIET: Connection to board DTB_WRPRHI opened.
[12:15:43.883] 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:
------------------------------------------------------
[12:15:43.886] INFO: RPC call hashes of host and DTB match: 398089610
[12:15:45.486] INFO: DUT info:
[12:15:45.486] INFO: The DUT currently contains the following objects:
[12:15:45.486] INFO: 2 TBM Cores tbm08c (2 ON)
[12:15:45.486] INFO: TBM Core alpha (0): 7 registers set
[12:15:45.486] INFO: TBM Core beta (1): 7 registers set
[12:15:45.486] INFO: 16 ROCs psi46digv21respin (16 ON) with 4160 pixelConfigs
[12:15:45.486] INFO: ROC 0: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 1: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 2: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 3: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 4: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 5: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 6: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 7: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 8: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 9: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 10: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 11: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 12: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 13: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 14: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:45.486] INFO: ROC 15: 19 DACs set, Pixels: 0 masked, 0 active.
[12:15:46.083] INFO: PixTestCmd::init()
[12:15:46.088] INFO: readGainPedestalParameters /home/CMS_pixel/Testing/pxar_fermi/data/mi304/phCalibrationFitErr35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/phCalibrationFitErr35_C15.dat
[12:15:46.387] INFO: readReadbackCal: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/readbackCal_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/readbackCal_C15.dat
[12:15:56.976] INFO: ######################################################################
[12:15:56.976] INFO: PixTestAlive::doTest()
[12:15:56.976] INFO: ######################################################################
[12:15:56.980] INFO: ----------------------------------------------------------------------
[12:15:56.980] INFO: PixTestAlive::aliveTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[12:15:56.980] INFO: ----------------------------------------------------------------------
[12:15:57.357] INFO: Expecting 41600 events.
[12:16:01.617] INFO: 41600 events read in total (3542ms).
[12:16:01.765] INFO: Test took 4783ms.
[12:16:01.774] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:16:02.046] INFO: PixTestAlive::aliveTest() done
[12:16:02.046] INFO: number of dead pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 4 2 0 0
[12:16:02.068] INFO: ----------------------------------------------------------------------
[12:16:02.069] INFO: PixTestAlive::maskTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[12:16:02.069] INFO: ----------------------------------------------------------------------
[12:16:02.445] INFO: Expecting 41600 events.
[12:16:05.498] INFO: 41600 events read in total (2338ms).
[12:16:05.498] INFO: Test took 3427ms.
[12:16:05.498] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:16:05.499] INFO: mask vs. old pixelAlive PixelAlive_C0_V0 .. PixelAlive_C15_V0
[12:16:05.921] INFO: PixTestAlive::maskTest() done
[12:16:05.921] INFO: number of mask-defect pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[12:16:05.939] INFO: ----------------------------------------------------------------------
[12:16:05.940] INFO: PixTestAlive::addressDecodingTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[12:16:05.940] INFO: ----------------------------------------------------------------------
[12:16:06.316] INFO: Expecting 41600 events.
[12:16:10.586] INFO: 41600 events read in total (3555ms).
[12:16:10.587] INFO: Test took 4645ms.
[12:16:10.597] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:16:10.969] INFO: PixTestAlive::addressDecodingTest() done
[12:16:10.969] INFO: number of address-decoding pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[12:16:10.969] INFO: PixTestAlive::doTest() done, duration: 13 seconds
[12:16:23.989] INFO: ----------------------------------------------------------------------
[12:16:23.989] INFO: PixTestHighRate::calDelScan() ntrig = 10, vcal = 200
[12:16:23.989] INFO: ----------------------------------------------------------------------
[12:16:24.128] INFO: Expecting 768 events.
[12:16:25.260] INFO: 768 events read in total (417ms).
[12:16:25.260] INFO: Test took 1265ms.
[12:16:26.064] INFO: Expecting 41600 events.
[12:16:29.322] INFO: 41600 events read in total (2732ms).
[12:16:29.326] INFO: Test took 4060ms.
[12:16:29.408] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:16:30.111] INFO: Expecting 41600 events.
[12:16:33.462] INFO: 41600 events read in total (2824ms).
[12:16:33.466] INFO: Test took 4019ms.
[12:16:33.545] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:16:34.250] INFO: Expecting 41600 events.
[12:16:37.627] INFO: 41600 events read in total (2851ms).
[12:16:37.631] INFO: Test took 4047ms.
[12:16:37.711] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:16:38.417] INFO: Expecting 41600 events.
[12:16:41.799] INFO: 41600 events read in total (2855ms).
[12:16:41.803] INFO: Test took 4052ms.
[12:16:41.882] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:16:42.588] INFO: Expecting 41600 events.
[12:16:45.948] INFO: 41600 events read in total (2833ms).
[12:16:45.952] INFO: Test took 4030ms.
[12:16:46.031] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:16:46.737] INFO: Expecting 41600 events.
[12:16:50.114] INFO: 41600 events read in total (2851ms).
[12:16:50.117] INFO: Test took 4045ms.
[12:16:50.195] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:16:50.900] INFO: Expecting 41600 events.
[12:16:54.279] INFO: 41600 events read in total (2852ms).
[12:16:54.282] INFO: Test took 4047ms.
[12:16:54.361] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:16:55.066] INFO: Expecting 41600 events.
[12:16:58.449] INFO: 41600 events read in total (2856ms).
[12:16:58.453] INFO: Test took 4052ms.
[12:16:58.531] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:16:59.236] INFO: Expecting 41600 events.
[12:17:02.628] INFO: 41600 events read in total (2865ms).
[12:17:02.631] INFO: Test took 4060ms.
[12:17:02.709] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:17:03.414] INFO: Expecting 41600 events.
[12:17:06.790] INFO: 41600 events read in total (2850ms).
[12:17:06.793] INFO: Test took 4044ms.
[12:17:06.872] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:17:07.577] INFO: Expecting 41600 events.
[12:17:10.962] INFO: 41600 events read in total (2858ms).
[12:17:10.966] INFO: Test took 4054ms.
[12:17:11.045] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:17:11.750] INFO: Expecting 41600 events.
[12:17:15.141] INFO: 41600 events read in total (2864ms).
[12:17:15.145] INFO: Test took 4060ms.
[12:17:15.222] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:17:15.928] INFO: Expecting 41600 events.
[12:17:19.310] INFO: 41600 events read in total (2856ms).
[12:17:19.314] INFO: Test took 4051ms.
[12:17:19.392] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:17:20.097] INFO: Expecting 41600 events.
[12:17:23.478] INFO: 41600 events read in total (2854ms).
[12:17:23.482] INFO: Test took 4050ms.
[12:17:23.561] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:17:24.267] INFO: Expecting 41600 events.
[12:17:27.647] INFO: 41600 events read in total (2853ms).
[12:17:27.650] INFO: Test took 4049ms.
[12:17:27.729] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:17:28.435] INFO: Expecting 41600 events.
[12:17:31.823] INFO: 41600 events read in total (2862ms).
[12:17:31.826] INFO: Test took 4056ms.
[12:17:31.906] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:17:32.612] INFO: Expecting 41600 events.
[12:17:36.002] INFO: 41600 events read in total (2864ms).
[12:17:36.005] INFO: Test took 4059ms.
[12:17:36.085] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:17:36.791] INFO: Expecting 41600 events.
[12:17:40.166] INFO: 41600 events read in total (2849ms).
[12:17:40.170] INFO: Test took 4044ms.
[12:17:40.248] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:17:40.953] INFO: Expecting 41600 events.
[12:17:44.301] INFO: 41600 events read in total (2822ms).
[12:17:44.305] INFO: Test took 4017ms.
[12:17:44.384] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:17:45.089] INFO: Expecting 41600 events.
[12:17:48.262] INFO: 41600 events read in total (2646ms).
[12:17:48.266] INFO: Test took 3841ms.
[12:17:48.344] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:17:58.981] INFO: ----------------------------------------------------------------------
[12:17:58.981] INFO: PixTestHighRate::xPixelAlive() ntrig = 50, vcal = 200
[12:17:58.981] INFO: ----------------------------------------------------------------------
[12:17:59.663] INFO: Expecting 208000 events.
[12:18:12.304] INFO: 208000 events read in total (12115ms).
[12:18:12.316] INFO: Test took 13319ms.
[12:18:12.692] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:18:13.060] INFO: number of dead pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 4 2 0 0
[12:18:13.060] INFO: number of red-efficiency pixels: 110 64 141 214 267 224 286 228 283 292 240 256 224 126 81 72
[12:18:13.060] INFO: number of X-ray hits detected: 73138 57497 99578 146067 158885 159186 158720 148605 169586 170848 161747 153137 152204 103996 58225 68324
[12:18:13.060] INFO: number of triggers sent (total per ROC): 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000
[12:18:13.060] INFO: number of Vcal hits detected: 207887 207935 207857 207780 207728 207766 207703 207759 207681 207687 207751 207731 207570 207769 207917 207925
[12:18:13.060] INFO: Vcal hit fiducial efficiency (%): 99.9 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
[12:18:13.060] INFO: Vcal hit overall efficiency (%): 99.9 100.0 99.9 99.9 99.9 99.9 99.9 99.9 99.8 99.8 99.9 99.9 99.8 99.9 100.0 100.0
[12:18:13.060] INFO: X-ray hit rate [MHz/cm2]: 21.4 16.9 29.2 42.8 46.6 46.7 46.5 43.6 49.7 50.1 47.4 44.9 44.6 30.5 17.1 20.0
[12:18:13.060] INFO: PixTestHighRate::doXPixelAlive() done
[12:18:13.104] INFO: PixTest:: pg_setup set to default.
[12:18:22.238] QUIET: Connection to board 58 closed.
[12:12:59.150] INFO: *** Welcome to pxar ***
[12:12:59.150] INFO: *** Today: 2016/06/01
[12:12:59.173] INFO: *** Version: v1.9.0-805-geb36
[12:12:59.173] INFO: readRocDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/dacParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/dacParameters35_C15.dat
[12:12:59.174] INFO: readTbmDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/tbmParameters_C0a.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/tbmParameters_C0b.dat
[12:12:59.174] INFO: readMaskFile: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/defaultMaskFile.dat
[12:12:59.174] INFO: readTrimFile: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/trimParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/trimParameters35_C15.dat
[12:12:59.328] INFO: clk: 4
[12:12:59.328] INFO: ctr: 4
[12:12:59.328] INFO: sda: 19
[12:12:59.328] INFO: tin: 9
[12:12:59.328] INFO: level: 15
[12:12:59.328] INFO: triggerdelay: 0
[12:12:59.328] QUIET: Instanciating API for pxar v1.9.0+803~gf2ecfa7
[12:12:59.328] INFO: Log level: INFO
[12:12:59.340] QUIET: Connection to board DTB_WRPRHI opened.
[12:12:59.343] 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:
------------------------------------------------------
[12:12:59.346] INFO: RPC call hashes of host and DTB match: 398089610
[12:13:00.945] INFO: DUT info:
[12:13:00.945] INFO: The DUT currently contains the following objects:
[12:13:00.945] INFO: 2 TBM Cores tbm08c (2 ON)
[12:13:00.945] INFO: TBM Core alpha (0): 7 registers set
[12:13:00.945] INFO: TBM Core beta (1): 7 registers set
[12:13:00.945] INFO: 16 ROCs psi46digv21respin (16 ON) with 4160 pixelConfigs
[12:13:00.945] INFO: ROC 0: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 1: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 2: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 3: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 4: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 5: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 6: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 7: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 8: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 9: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 10: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 11: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 12: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.945] INFO: ROC 13: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.946] INFO: ROC 14: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:00.946] INFO: ROC 15: 19 DACs set, Pixels: 0 masked, 0 active.
[12:13:01.531] INFO: PixTestCmd::init()
[12:13:01.552] INFO: readGainPedestalParameters /home/CMS_pixel/Testing/pxar_fermi/data/mi304/phCalibrationFitErr35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/phCalibrationFitErr35_C15.dat
[12:13:01.853] INFO: readReadbackCal: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/readbackCal_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/readbackCal_C15.dat
[12:13:07.112] INFO: ######################################################################
[12:13:07.112] INFO: PixTestAlive::doTest()
[12:13:07.112] INFO: ######################################################################
[12:13:07.116] INFO: ----------------------------------------------------------------------
[12:13:07.116] INFO: PixTestAlive::aliveTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[12:13:07.116] INFO: ----------------------------------------------------------------------
[12:13:07.494] INFO: Expecting 41600 events.
[12:13:11.747] INFO: 41600 events read in total (3535ms).
[12:13:11.896] INFO: Test took 4778ms.
[12:13:11.907] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:13:12.180] INFO: PixTestAlive::aliveTest() done
[12:13:12.180] INFO: number of dead pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 4 2 0 0
[12:13:12.202] INFO: ----------------------------------------------------------------------
[12:13:12.202] INFO: PixTestAlive::maskTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[12:13:12.202] INFO: ----------------------------------------------------------------------
[12:13:12.578] INFO: Expecting 41600 events.
[12:13:15.628] INFO: 41600 events read in total (2334ms).
[12:13:15.629] INFO: Test took 3425ms.
[12:13:15.629] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:13:15.629] INFO: mask vs. old pixelAlive PixelAlive_C0_V0 .. PixelAlive_C15_V0
[12:13:16.052] INFO: PixTestAlive::maskTest() done
[12:13:16.052] INFO: number of mask-defect pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[12:13:16.070] INFO: ----------------------------------------------------------------------
[12:13:16.070] INFO: PixTestAlive::addressDecodingTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[12:13:16.070] INFO: ----------------------------------------------------------------------
[12:13:16.446] INFO: Expecting 41600 events.
[12:13:20.692] INFO: 41600 events read in total (3531ms).
[12:13:20.694] INFO: Test took 4622ms.
[12:13:20.705] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:13:21.077] INFO: PixTestAlive::addressDecodingTest() done
[12:13:21.077] INFO: number of address-decoding pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[12:13:21.077] INFO: PixTestAlive::doTest() done, duration: 13 seconds
[12:13:23.173] INFO: ----------------------------------------------------------------------
[12:13:23.173] INFO: PixTestHighRate::calDelScan() ntrig = 10, vcal = 200
[12:13:23.173] INFO: ----------------------------------------------------------------------
[12:13:23.312] INFO: Expecting 768 events.
[12:13:24.446] INFO: 768 events read in total (417ms).
[12:13:24.446] INFO: Test took 1267ms.
[12:13:25.249] INFO: Expecting 41600 events.
[12:13:28.735] INFO: 41600 events read in total (2959ms).
[12:13:28.740] INFO: Test took 4289ms.
[12:13:28.860] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:13:29.578] INFO: Expecting 41600 events.
[12:13:33.139] INFO: 41600 events read in total (3034ms).
[12:13:33.144] INFO: Test took 4232ms.
[12:13:33.262] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:13:33.981] INFO: Expecting 41600 events.
[12:13:37.563] INFO: 41600 events read in total (3056ms).
[12:13:37.567] INFO: Test took 4251ms.
[12:13:37.687] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:13:38.406] INFO: Expecting 41600 events.
[12:13:41.997] INFO: 41600 events read in total (3065ms).
[12:13:42.002] INFO: Test took 4261ms.
[12:13:42.120] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:13:42.840] INFO: Expecting 41600 events.
[12:13:46.419] INFO: 41600 events read in total (3053ms).
[12:13:46.424] INFO: Test took 4249ms.
[12:13:46.542] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:13:47.263] INFO: Expecting 41600 events.
[12:13:50.854] INFO: 41600 events read in total (3064ms).
[12:13:50.859] INFO: Test took 4261ms.
[12:13:50.977] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:13:51.696] INFO: Expecting 41600 events.
[12:13:55.291] INFO: 41600 events read in total (3068ms).
[12:13:55.295] INFO: Test took 4264ms.
[12:13:55.414] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:13:56.135] INFO: Expecting 41600 events.
[12:13:59.740] INFO: 41600 events read in total (3079ms).
[12:13:59.744] INFO: Test took 4274ms.
[12:13:59.861] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:00.581] INFO: Expecting 41600 events.
[12:14:04.196] INFO: 41600 events read in total (3089ms).
[12:14:04.200] INFO: Test took 4284ms.
[12:14:04.318] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:05.037] INFO: Expecting 41600 events.
[12:14:08.653] INFO: 41600 events read in total (3089ms).
[12:14:08.657] INFO: Test took 4285ms.
[12:14:08.774] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:09.494] INFO: Expecting 41600 events.
[12:14:13.105] INFO: 41600 events read in total (3085ms).
[12:14:13.110] INFO: Test took 4282ms.
[12:14:13.227] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:13.947] INFO: Expecting 41600 events.
[12:14:17.563] INFO: 41600 events read in total (3090ms).
[12:14:17.568] INFO: Test took 4286ms.
[12:14:17.685] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:18.405] INFO: Expecting 41600 events.
[12:14:22.020] INFO: 41600 events read in total (3088ms).
[12:14:22.024] INFO: Test took 4284ms.
[12:14:22.142] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:22.862] INFO: Expecting 41600 events.
[12:14:26.483] INFO: 41600 events read in total (3095ms).
[12:14:26.487] INFO: Test took 4290ms.
[12:14:26.605] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:27.325] INFO: Expecting 41600 events.
[12:14:30.939] INFO: 41600 events read in total (3088ms).
[12:14:30.943] INFO: Test took 4284ms.
[12:14:31.060] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:31.780] INFO: Expecting 41600 events.
[12:14:35.394] INFO: 41600 events read in total (3088ms).
[12:14:35.398] INFO: Test took 4283ms.
[12:14:35.517] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:36.237] INFO: Expecting 41600 events.
[12:14:39.851] INFO: 41600 events read in total (3087ms).
[12:14:39.856] INFO: Test took 4284ms.
[12:14:39.971] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:40.690] INFO: Expecting 41600 events.
[12:14:44.300] INFO: 41600 events read in total (3083ms).
[12:14:44.304] INFO: Test took 4279ms.
[12:14:44.421] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:45.140] INFO: Expecting 41600 events.
[12:14:48.702] INFO: 41600 events read in total (3035ms).
[12:14:48.707] INFO: Test took 4231ms.
[12:14:48.822] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:49.543] INFO: Expecting 41600 events.
[12:14:52.936] INFO: 41600 events read in total (2866ms).
[12:14:52.941] INFO: Test took 4063ms.
[12:14:53.054] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:14:58.021] INFO: ----------------------------------------------------------------------
[12:14:58.021] INFO: PixTestHighRate::xPixelAlive() ntrig = 50, vcal = 200
[12:14:58.021] INFO: ----------------------------------------------------------------------
[12:14:58.701] INFO: Expecting 208000 events.
[12:15:13.100] INFO: 208000 events read in total (13872ms).
[12:15:13.117] INFO: Test took 15080ms.
[12:15:13.674] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:15:14.113] INFO: number of dead pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 4 2 0 0
[12:15:14.113] INFO: number of red-efficiency pixels: 177 130 267 416 664 471 476 441 567 549 526 445 488 277 116 124
[12:15:14.113] INFO: number of X-ray hits detected: 112793 88707 152318 224938 243533 243371 243177 230139 260190 263649 248419 235200 233354 160802 90666 104851
[12:15:14.113] INFO: number of triggers sent (total per ROC): 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000
[12:15:14.113] INFO: number of Vcal hits detected: 207815 207867 207712 207555 207243 207463 207472 207519 207373 207397 207409 207495 207269 207609 207881 207872
[12:15:14.113] INFO: Vcal hit fiducial efficiency (%): 99.9 99.9 99.9 99.8 99.7 99.8 99.8 99.8 99.7 99.7 99.7 99.8 99.8 99.9 99.9 99.9
[12:15:14.113] INFO: Vcal hit overall efficiency (%): 99.9 99.9 99.9 99.8 99.6 99.7 99.7 99.8 99.7 99.7 99.7 99.8 99.6 99.8 99.9 99.9
[12:15:14.113] INFO: X-ray hit rate [MHz/cm2]: 33.1 26.0 44.6 65.9 71.4 71.3 71.3 67.5 76.3 77.3 72.8 68.9 68.4 47.1 26.6 30.7
[12:15:14.113] INFO: PixTestHighRate::doXPixelAlive() done
[12:15:14.159] INFO: PixTest:: pg_setup set to default.
[12:15:36.256] QUIET: Connection to board 58 closed.
[12:09:41.639] INFO: *** Welcome to pxar ***
[12:09:41.639] INFO: *** Today: 2016/06/01
[12:09:41.662] INFO: *** Version: v1.9.0-805-geb36
[12:09:41.662] INFO: readRocDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/dacParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/dacParameters35_C15.dat
[12:09:41.663] INFO: readTbmDacs: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/tbmParameters_C0a.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/tbmParameters_C0b.dat
[12:09:41.663] INFO: readMaskFile: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/defaultMaskFile.dat
[12:09:41.663] INFO: readTrimFile: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/trimParameters35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/trimParameters35_C15.dat
[12:09:41.812] INFO: clk: 4
[12:09:41.812] INFO: ctr: 4
[12:09:41.812] INFO: sda: 19
[12:09:41.812] INFO: tin: 9
[12:09:41.812] INFO: level: 15
[12:09:41.812] INFO: triggerdelay: 0
[12:09:41.812] QUIET: Instanciating API for pxar v1.9.0+803~gf2ecfa7
[12:09:41.812] INFO: Log level: INFO
[12:09:41.822] QUIET: Connection to board DTB_WRPRHI opened.
[12:09:41.826] 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:
------------------------------------------------------
[12:09:41.828] INFO: RPC call hashes of host and DTB match: 398089610
[12:09:43.428] INFO: DUT info:
[12:09:43.428] INFO: The DUT currently contains the following objects:
[12:09:43.429] INFO: 2 TBM Cores tbm08c (2 ON)
[12:09:43.429] INFO: TBM Core alpha (0): 7 registers set
[12:09:43.429] INFO: TBM Core beta (1): 7 registers set
[12:09:43.429] INFO: 16 ROCs psi46digv21respin (16 ON) with 4160 pixelConfigs
[12:09:43.429] INFO: ROC 0: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 1: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 2: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 3: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 4: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 5: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 6: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 7: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 8: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 9: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 10: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 11: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 12: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 13: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 14: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:43.429] INFO: ROC 15: 19 DACs set, Pixels: 0 masked, 0 active.
[12:09:44.025] INFO: PixTestCmd::init()
[12:09:44.041] INFO: readGainPedestalParameters /home/CMS_pixel/Testing/pxar_fermi/data/mi304/phCalibrationFitErr35_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/phCalibrationFitErr35_C15.dat
[12:09:44.351] INFO: readReadbackCal: /home/CMS_pixel/Testing/pxar_fermi/data/mi304/readbackCal_C0.dat .. /home/CMS_pixel/Testing/pxar_fermi/data/mi304/readbackCal_C15.dat
[12:09:59.608] INFO: ######################################################################
[12:09:59.608] INFO: PixTestAlive::doTest()
[12:09:59.608] INFO: ######################################################################
[12:09:59.611] INFO: ----------------------------------------------------------------------
[12:09:59.611] INFO: PixTestAlive::aliveTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[12:09:59.611] INFO: ----------------------------------------------------------------------
[12:09:59.989] INFO: Expecting 41600 events.
[12:10:04.241] INFO: 41600 events read in total (3534ms).
[12:10:04.389] INFO: Test took 4775ms.
[12:10:04.399] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:10:04.671] INFO: PixTestAlive::aliveTest() done
[12:10:04.672] INFO: number of dead pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 4 2 0 0
[12:10:04.695] INFO: ----------------------------------------------------------------------
[12:10:04.695] INFO: PixTestAlive::maskTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[12:10:04.695] INFO: ----------------------------------------------------------------------
[12:10:05.072] INFO: Expecting 41600 events.
[12:10:08.126] INFO: 41600 events read in total (2339ms).
[12:10:08.127] INFO: Test took 3430ms.
[12:10:08.127] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:10:08.128] INFO: mask vs. old pixelAlive PixelAlive_C0_V0 .. PixelAlive_C15_V0
[12:10:08.549] INFO: PixTestAlive::maskTest() done
[12:10:08.549] INFO: number of mask-defect pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[12:10:08.567] INFO: ----------------------------------------------------------------------
[12:10:08.567] INFO: PixTestAlive::addressDecodingTest() ntrig = 10, vcal = 200 (ctrlreg = 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0)
[12:10:08.567] INFO: ----------------------------------------------------------------------
[12:10:08.945] INFO: Expecting 41600 events.
[12:10:13.199] INFO: 41600 events read in total (3539ms).
[12:10:13.201] INFO: Test took 4631ms.
[12:10:13.210] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:10:13.581] INFO: PixTestAlive::addressDecodingTest() done
[12:10:13.582] INFO: number of address-decoding pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0
[12:10:13.582] INFO: PixTestAlive::doTest() done, duration: 13 seconds
[12:10:22.549] INFO: ----------------------------------------------------------------------
[12:10:22.549] INFO: PixTestHighRate::calDelScan() ntrig = 10, vcal = 200
[12:10:22.549] INFO: ----------------------------------------------------------------------
[12:10:22.688] INFO: Expecting 768 events.
[12:10:23.820] INFO: 768 events read in total (417ms).
[12:10:23.820] INFO: Test took 1265ms.
[12:10:24.624] INFO: Expecting 41600 events.
[12:10:28.373] INFO: 41600 events read in total (3222ms).
[12:10:28.378] INFO: Test took 4552ms.
[12:10:28.536] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:10:29.268] INFO: Expecting 41600 events.
[12:10:33.100] INFO: 41600 events read in total (3305ms).
[12:10:33.105] INFO: Test took 4502ms.
[12:10:33.254] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:10:33.988] INFO: Expecting 41600 events.
[12:10:37.847] INFO: 41600 events read in total (3332ms).
[12:10:37.853] INFO: Test took 4530ms.
[12:10:38.004] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:10:38.736] INFO: Expecting 41600 events.
[12:10:42.592] INFO: 41600 events read in total (3329ms).
[12:10:42.597] INFO: Test took 4526ms.
[12:10:42.747] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:10:43.482] INFO: Expecting 41600 events.
[12:10:47.350] INFO: 41600 events read in total (3342ms).
[12:10:47.356] INFO: Test took 4540ms.
[12:10:47.510] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:10:48.243] INFO: Expecting 41600 events.
[12:10:52.106] INFO: 41600 events read in total (3336ms).
[12:10:52.112] INFO: Test took 4534ms.
[12:10:52.262] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:10:52.996] INFO: Expecting 41600 events.
[12:10:56.873] INFO: 41600 events read in total (3350ms).
[12:10:56.878] INFO: Test took 4547ms.
[12:10:57.028] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:10:57.763] INFO: Expecting 41600 events.
[12:11:01.646] INFO: 41600 events read in total (3356ms).
[12:11:01.651] INFO: Test took 4553ms.
[12:11:01.802] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:11:02.538] INFO: Expecting 41600 events.
[12:11:06.429] INFO: 41600 events read in total (3365ms).
[12:11:06.435] INFO: Test took 4562ms.
[12:11:06.588] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:11:07.322] INFO: Expecting 41600 events.
[12:11:11.216] INFO: 41600 events read in total (3368ms).
[12:11:11.222] INFO: Test took 4565ms.
[12:11:11.374] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:11:12.109] INFO: Expecting 41600 events.
[12:11:16.001] INFO: 41600 events read in total (3366ms).
[12:11:16.007] INFO: Test took 4563ms.
[12:11:16.157] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:11:16.892] INFO: Expecting 41600 events.
[12:11:20.783] INFO: 41600 events read in total (3364ms).
[12:11:20.788] INFO: Test took 4561ms.
[12:11:20.943] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:11:21.676] INFO: Expecting 41600 events.
[12:11:25.564] INFO: 41600 events read in total (3362ms).
[12:11:25.570] INFO: Test took 4559ms.
[12:11:25.719] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:11:26.454] INFO: Expecting 41600 events.
[12:11:30.342] INFO: 41600 events read in total (3362ms).
[12:11:30.348] INFO: Test took 4559ms.
[12:11:30.497] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:11:31.233] INFO: Expecting 41600 events.
[12:11:35.128] INFO: 41600 events read in total (3369ms).
[12:11:35.133] INFO: Test took 4565ms.
[12:11:35.281] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:11:36.017] INFO: Expecting 41600 events.
[12:11:39.906] INFO: 41600 events read in total (3362ms).
[12:11:39.912] INFO: Test took 4560ms.
[12:11:40.065] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:11:40.800] INFO: Expecting 41600 events.
[12:11:44.687] INFO: 41600 events read in total (3361ms).
[12:11:44.692] INFO: Test took 4557ms.
[12:11:44.840] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:11:45.575] INFO: Expecting 41600 events.
[12:11:49.457] INFO: 41600 events read in total (3355ms).
[12:11:49.462] INFO: Test took 4552ms.
[12:11:49.615] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:11:50.348] INFO: Expecting 41600 events.
[12:11:54.167] INFO: 41600 events read in total (3292ms).
[12:11:54.172] INFO: Test took 4489ms.
[12:11:54.321] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:11:55.056] INFO: Expecting 41600 events.
[12:11:58.693] INFO: 41600 events read in total (3111ms).
[12:11:58.699] INFO: Test took 4308ms.
[12:11:58.848] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:12:16.773] INFO: ----------------------------------------------------------------------
[12:12:16.773] INFO: PixTestHighRate::xPixelAlive() ntrig = 50, vcal = 200
[12:12:16.773] INFO: ----------------------------------------------------------------------
[12:12:17.454] INFO: Expecting 208000 events.
[12:12:33.716] INFO: 208000 events read in total (15736ms).
[12:12:33.738] INFO: Test took 16950ms.
[12:12:34.498] INFO: Fetched DAQ statistics. Counters are being reset now.
[12:12:35.010] INFO: number of dead pixels (per ROC): 0 0 0 0 0 0 0 0 0 0 0 0 4 2 0 0
[12:12:35.010] INFO: number of red-efficiency pixels: 285 210 424 693 858 854 903 777 1013 1005 903 846 815 506 192 200
[12:12:35.010] INFO: number of X-ray hits detected: 152234 120954 207526 304689 329234 330948 329867 310297 353709 356015 337291 317688 316576 217441 122760 143624
[12:12:35.010] INFO: number of triggers sent (total per ROC): 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000 208000
[12:12:35.010] INFO: number of Vcal hits detected: 207698 207780 207524 207224 207006 206935 206880 207106 206793 206763 206923 206983 206812 207330 207800 207790
[12:12:35.010] INFO: Vcal hit fiducial efficiency (%): 99.9 99.9 99.8 99.7 99.6 99.5 99.5 99.6 99.5 99.5 99.5 99.6 99.6 99.8 99.9 99.9
[12:12:35.010] INFO: Vcal hit overall efficiency (%): 99.9 99.9 99.8 99.6 99.5 99.5 99.5 99.6 99.4 99.4 99.5 99.5 99.4 99.7 99.9 99.9
[12:12:35.010] INFO: X-ray hit rate [MHz/cm2]: 44.6 35.5 60.8 89.3 96.5 97.0 96.7 91.0 103.7 104.4 98.9 93.1 92.8 63.7 36.0 42.1
[12:12:35.010] INFO: PixTestHighRate::doXPixelAlive() done
[12:12:35.056] INFO: PixTest:: pg_setup set to default.
[12:12:49.082] QUIET: Connection to board 58 closed.