Jobsub ID 26479.78@dunegpschedd02.fnal.gov

Jobsub ID	26479.78@dunegpschedd02.fnal.gov
Workflow ID	1854
Stage ID	1
User name	epennacc@fnal.gov
HTCondor Group	group_dune.prod.mcsim
Requested	Processors	1
	GPU	No
	RSS bytes	4194304000 (4000 MiB)
	Wall seconds limit	80000 (22 hours)
Submitted time	2025-08-26 13:20:54
Site	FR_CCIN2P3
Entry	DUNE_FR_CCIN2P3_cccondorce04
Last heartbeat	2025-08-26 14:17:50
From worker node	Hostname	ccwcondor0024
	cpuinfo	AMD EPYC 9334 32-Core Processor
	OS release	Scientific Linux release 7.9 (Nitrogen)
	Processors	1
	RSS bytes	4194304000 (4000 MiB)
	Wall seconds limit	106200 (29 hours)
	GPU
	Inner Apptainer?	True
Job state	finished
Started	2025-08-26 13:22:53
Input files	monte-carlo-001854-004982
Jobscript	Exit code	0
	Real time	53m (3213s)
	CPU time	52m (3158s = 98%)
	Max RSS bytes	3502788608 (3340 MiB)
Outputting started	2025-08-26 14:16:27
Output files	fardet-hd:prodbackground_radiological_decay0_dune10kt_1x2x6_centralAPA_20250826T132257Z_gen_004982_supernova_g4_detsim.root
Finished	2025-08-26 14:17:50
Saved logs	justin-logs:26479.78-dunegpschedd02.fnal.gov.logs.tgz
List job events Cached HTCondor job logs
Jobscript log (last 10,000 characters)

50] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.68 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.67 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.66 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.65 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.64 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.64 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.63 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.61 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.6 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.6 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.6 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.59 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.59 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.58 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.58 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.56 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.55 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::FrameFanin : 0.53 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.52 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.52 sec
[16:12:02.250] I [ timer  ] Timer: wcls::FrameSaver : 0.51 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::DepoSetFanout : 0.48 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Retagger : 0.47 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::DumpFrames : 0.44 sec
[16:12:02.250] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.44 sec
[16:12:02.250] I [ timer  ] Timer: wcls::SimDepoSource : 0.19 sec
[16:12:02.250] I [ timer  ] Timer: Total node execution : 217.97000241279602 sec
wclsFrameSaver: saving raw::RawDigits tagged "daq"
Begin processing the 10th record. run: 1854 subRun: 0 event: 49820 at 26-Aug-2025 16:12:17 CEST
SimDepoSource got 141308 depos from art tag "InputTag: label = 'IonAndScint', instance = ''" returns: okay
SimDepoSource: ready with 141308 depos spanning: [-2245.85, 2245.47]us
Retagger: tagging trace set: daq with 30720 traces, 0 summary
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::DepoTransform : 19.2 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::DepoTransform : 19.14 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::DepoTransform : 18.5 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::DepoTransform : 16.54 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::DepoTransform : 14.74 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::DepoTransform : 13.47 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::DepoTransform : 13.45 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::DepoTransform : 13.37 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::DepoTransform : 13.24 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::DepoTransform : 13.12 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::DepoTransform : 9.49 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::DepoTransform : 9.16 sec
[16:16:09.705] I [ timer  ] Timer: wcls::SimChannelSink : 2.35 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::Drifter : 1.02 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.83 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.82 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.8 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.8 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.79 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.77 sec
[16:16:09.705] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.76 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.76 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.74 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.72 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.71 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.69 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.68 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.68 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.68 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.67 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.66 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.65 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.65 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.64 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.64 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.62 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.62 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.62 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.6 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.6 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.6 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.59 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::IncoherentAddNoise : 0.59 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Digitizer : 0.59 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.58 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.5 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.5 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::DepoSetFanout : 0.49 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::DumpFrames : 0.48 sec
[16:16:09.706] I [ timer  ] Timer: wcls::FrameSaver : 0.48 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Retagger : 0.47 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::FrameFanin : 0.47 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.47 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.45 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::Reframer : 0.45 sec
[16:16:09.706] I [ timer  ] Timer: WireCell::Gen::DepoBagger : 0.43 sec
[16:16:09.706] I [ timer  ] Timer: wcls::SimDepoSource : 0.28 sec
[16:16:09.706] I [ timer  ] Timer: Total node execution : 203.40999990701675 sec
wclsFrameSaver: saving raw::RawDigits tagged "daq"
26-Aug-2025 16:16:24 CEST  Closed output file "prodbackground_radiological_decay0_dune10kt_1x2x6_centralAPA_20250826T132257Z_gen_004982_supernova_g4_detsim.root"
26-Aug-2025 16:16:24 CEST  Closed input file "prodbackground_radiological_decay0_dune10kt_1x2x6_centralAPA_20250826T132257Z_gen_004982_supernova_g4.root"

================================================================================================================================
TimeTracker printout (sec)                        Min           Avg           Max         Median          RMS         nEvts   
================================================================================================================================
Full event                                      229.104       248.387       262.279       248.575       10.6335        10     
--------------------------------------------------------------------------------------------------------------------------------
source:RootInput(read)                        0.00098463    0.00506612    0.00882485    0.00496013    0.00185409       10     
simulate:tpcrawdecoder:WireCellToolkit          217.556       236.888       250.632       237.579       10.5713        10     
simulate:opdigi:OpDetDigitizerDUNE              2.63245       2.77631       2.89519       2.78863      0.0750379       10     
simulate:rns:RandomNumberSaver                3.4823e-05    6.59267e-05   0.000238861   4.6405e-05    5.80449e-05      10     
[art]:TriggerResults:TriggerResultInserter    1.5183e-05    2.14864e-05   4.3686e-05     1.98e-05     7.56862e-06      10     
end_path:out1:RootOutput                       4.477e-06    6.8182e-06    2.0521e-05     5.463e-06    4.58117e-06      10     
end_path:out1:RootOutput(write)                 7.91156       8.71766       9.17741       8.76849      0.358445        10     
================================================================================================================================

====================================================================================================
MemoryTracker summary (base-10 MB units used)

  Peak virtual memory usage (VmPeak)  : 5183.96 MB
  Peak resident set size usage (VmHWM): 3502.79 MB
====================================================================================================
Art has completed and will exit with status 0.
written output file: prodbackground_radiological_decay0_dune10kt_1x2x6_centralAPA_20250826T132257Z_gen_004982.root 21954348
written output file: prodbackground_radiological_decay0_dune10kt_1x2x6_centralAPA_20250826T132257Z_gen_004982_supernova_g4.root 180421247
written output file: prodbackground_radiological_decay0_dune10kt_1x2x6_centralAPA_20250826T132257Z_gen_004982_supernova_g4_detsim.root 2353201401
written output file: prodbackground_radiological_decay0_dune10kt_1x2x6_centralAPA_20250826T132257Z_gen_004982_supernova_g4_detsim.root.ext.json 1561
written output file: prodbackground_radiological_decay0_dune10kt_1x2x6_centralAPA_20250826T132257Z_gen_004982_supernova_g4_detsim.root.json 1827
written output file: prodbackground_radiological_decay0_dune10kt_1x2x6_centralAPA_20250826T132257Z_gen_004982_supernova_g4_detsim.root.temp.json 1827
written output file: prodbackground_radiological_decay0_dune10kt_1x2x6_centralAPA_20250826T132257Z_gen_004982_supernova_g4_detsim_hist.root 519