Jobsub ID 244102.1@dunegpschedd01.fnal.gov
| Jobsub ID | 244102.1@dunegpschedd01.fnal.gov |
| Workflow ID | 9800 |
| Stage ID | 1 |
| User name | pmelas@fnal.gov |
| Requested | Processors | 1 |
| GPU | No |
| RSS bytes | 8388608000 (8000 MiB) |
| Wall seconds limit | 86400 (24 hours) |
| Submitted time | 2025-11-06 07:50:57 |
| Site | UK_Manchester |
| Entry | UBoone_T2_UK_Manchester_ce02 |
| Last heartbeat | 2025-11-06 12:54:21 |
| From worker node | Hostname | wn2210250.tier2.hep.manchester.ac.uk |
| cpuinfo | AMD EPYC 7513 32-Core Processor |
| OS release | Scientific Linux release 7.9 (Nitrogen) |
| Processors | 1 |
| RSS bytes | 10485760000 (10000 MiB) |
| Wall seconds limit | 257400 (71 hours) |
| GPU | |
| Inner Apptainer? | True |
| Job state | finished |
| Started | 2025-11-06 07:51:25 |
| Input files | monte-carlo-009800-000001
|
| Jobscript | Exit code | 0 |
| Real time | 5h (18074s) |
| CPU time | 4h (17525s = 96%) |
| Max RSS bytes | 4530495488 (4320 MiB) |
| Outputting started | 2025-11-06 12:52:40 |
| Output files | https://fndcadoor.fnal.gov:2880/dune/scratch/users/pmelas/fnal/09800/1/001/reco_stage1.root
|
| Finished | 2025-11-06 12:54:21 |
| Saved logs | justin-logs:244102.1-dunegpschedd01.fnal.gov.logs.tgz |
| List job events Cached HTCondor job logs |
Jobscript log (last 10,000 characters)
gnalFinder
ToolBasedRawDigitPrepService:prepare: Running tool adcScaleKeToAdc
ToolBasedRawDigitPrepService:prepare: Running tool pdsp_RemoveBadChannels
ToolBasedRawDigitPrepService:endEvent: End processing run 1 event 10 with 7 tools.
CookedFrameSource: got 15360 recob::Wire objects
input nticks=6000 keeping as is
Retagger: tagging trace set: wiener with 153011 traces, 0 summary
Retagger: tagging trace set: gauss with 113641 traces, 0 summary
wclsFrameSaver saving cooked to 6000 ticks
wclsFrameSaver: saving 113641 traces tagged "gauss"
FrameSaver: q=4.08331e+06 n=1971360 tag=gauss
wclsFrameSaver: saving 153011 traces tagged "wiener"
FrameSaver: q=4.3405e+06 n=1732061 tag=wiener
72 X, 28 U, 34 V bad channels
Finding XUV coincidences...
C:0 T:0 52694 XUs and 41207 XVs -> 705 XUVs
C:0 T:1 130469 XUs and 95070 XVs -> 11073 XUVs
C:0 T:2 57253 XUs and 77596 XVs -> 2734 XUVs
C:0 T:3 34141 XUs and 36646 XVs -> 278 XUVs
C:0 T:4 17035 XUs and 16371 XVs -> 544 XUVs
C:0 T:5 73230 XUs and 52335 XVs -> 5601 XUVs
C:0 T:6 102613 XUs and 140073 XVs -> 7288 XUVs
C:0 T:7 40148 XUs and 55694 XVs -> 602 XUVs
C:0 T:8 8409 XUs and 7166 XVs -> 102 XUVs
C:0 T:9 51841 XUs and 53192 XVs -> 5242 XUVs
C:0 T:10 75328 XUs and 34073 XVs -> 9314 XUVs
C:0 T:11 227 XUs and 130 XVs -> 11 XUVs
43494 XUVs total
12547 collection wire objects
39556 potential space points
Neighbour search...
3865532 tests to find 1845796 neighbours
Iterating with no regularization...
Begin: 6.82685e+07
0 5.49212e+07
1 5.37976e+07
2 5.36187e+07
3 5.35654e+07
Now with regularization...
Begin: 4.23779e+07
0 4.233e+07
1 4.22974e+07
run: 1 ; subrun: 0 ; event: 10
evttime: 410344139
fLifetime: 30000 [us]
run: 1 ; subrun: 0 ; event: 10
evttime: 410344139
fLifetime: 30000 [us]
06-Nov-2025 12:52:37 GMT Closed output file "reco_stage1.root"
06-Nov-2025 12:52:37 GMT Closed input file "detsim_stage2.root"
DataPrepModule::endJob: # events processed: 10
DataPrepModule::endJob: # events skipped: 0
====================================================================================================================================
TimeTracker printout (sec) Min Avg Max Median RMS nEvts
====================================================================================================================================
Full event 474.859 628.422 874.969 622.716 105.919 10
------------------------------------------------------------------------------------------------------------------------------------
source:RootInput(read) 0.00107737 0.00628269 0.0119427 0.00599236 0.00311448 10
reco:ophit:OpHitFinder 0.249183 0.410154 0.491475 0.425444 0.0659138 10
reco:opflash:OpFlashFinder 0.166638 0.27062 0.333185 0.279062 0.0516436 10
reco:opslicer:OpSlicer 0.60073 0.947335 1.1056 0.971256 0.149096 10
reco:caldata:DataPrepModule 5.90065 7.41886 8.40838 7.44618 0.655418 10
reco:wclsdatasp:WireCellToolkit 43.7016 48.9416 54.5729 48.9043 2.8937 10
reco:gaushit:GausHitFinder 1.36529 1.81384 2.21228 1.88165 0.260479 10
reco:nhitsfilter:NumberOfHitsFilter 0.000801173 0.00100673 0.00141402 0.000972666 0.000163757 10
reco:reco3d:SpacePointSolver 17.3489 26.825 37.4619 26.2413 5.96593 10
reco:hitpdune:DisambigFromSpacePoints 1.96885 2.70084 3.76692 2.6219 0.555078 10
reco:pandora:StandardPandora 37.7974 77.1709 148.557 67.8727 37.0347 10
reco:pandoraWriter:StandardPandora 0.487708 0.722319 0.891412 0.76095 0.115235 10
reco:pandoraTrack:LArPandoraTrackCreation 7.68785 12.2073 16.5653 12.3852 2.33772 10
reco:pandoraShower:LArPandoraShowerCreation 10.3036 14.4228 23.5331 13.884 3.83224 10
reco:pandoracalo:Calorimetry 5.10854 7.19005 9.23272 7.33175 1.1582 10
reco:pandoracalonosce:Calorimetry 4.85873 6.8612 8.89187 6.98345 1.05907 10
reco:pandorapid:Chi2ParticleID 0.00770144 0.00956298 0.0118772 0.00935905 0.00118658 10
reco:pandoracalinoxyzt:CalibrationdEdXPDSP 0.0707118 0.0827593 0.0950475 0.0819279 0.00863815 10
reco:pandoracalipidnoxyzt:Chi2ParticleID 0.00742929 0.00896112 0.0105876 0.00887157 0.000901536 10
reco:pandoraShowercalo:ShowerCalorimetry 11.8306 15.4404 23.9119 14.4465 3.82692 10
reco:pandoraShowercalonosce:ShowerCalorimetry 11.0145 15.1559 23.0658 15.0806 3.61065 10
reco:emtrkmichelid:EmTrackMichelId 215.216 265.38 345.761 259.759 32.903 10
reco:crttag:SingleCRTMatchingProducer 0.023666 0.0303755 0.0355351 0.0304539 0.0032024 10
reco:crtreco:TwoCRTMatchingProducer 0.0143241 0.0230825 0.0292299 0.0247008 0.00477814 10
reco:anodepiercerst0:T0RecoAnodePiercers 0.784685 1.06781 1.35762 1.06247 0.152059 10
reco:pandora2Track:LArPandoraTrackCreation 26.0454 37.0264 56.7316 35.3782 8.55056 10
reco:pandora2calo:Calorimetry 14.5811 21.1516 32.0542 18.4186 5.19946 10
reco:pandora2calonosce:Calorimetry 14.1104 19.7056 30.6539 17.39 4.99 10
reco:pandora2pid:Chi2ParticleID 0.0184103 0.0228978 0.0306898 0.0220115 0.00339893 10
reco:pandora2calinoxyzt:CalibrationdEdXPDSP 0.0875439 0.114742 0.188808 0.104251 0.0276318 10
reco:pandora2calipidnoxyzt:Chi2ParticleID 0.0183233 0.0218124 0.0283767 0.0213037 0.0029144 10
reco:pandora2Shower:LArPandoraShowerCreation 10.2093 12.3802 18.0366 11.7839 2.32563 10
reco:pandora2Showercalo:ShowerCalorimetry 9.11711 15.3945 24.8283 14.1871 4.22708 10
reco:pandora2Showercalonosce:ShowerCalorimetry 10.7469 13.2142 17.2418 12.3671 2.17015 10
[art]:TriggerResults:TriggerResultInserter 6.6835e-05 0.000116304 0.000211026 9.18025e-05 4.68928e-05 10
end_path:out1:RootOutput 8.606e-06 1.66232e-05 4.0406e-05 1.2293e-05 9.33924e-06 10
end_path:out1:RootOutput(write) 3.4695 4.01602 5.06907 3.8627 0.527852 10
====================================================================================================================================
====================================================================================================
MemoryTracker summary (base-10 MB units used)
Peak virtual memory usage (VmPeak) : 5379.09 MB
Peak resident set size usage (VmHWM): 4530.5 MB
Details saved in: 'mem.db'
====================================================================================================
ToolBasedRawDigitPrepService:dtor: Event count: 10
ToolBasedRawDigitPrepService:dtor: Call count: 60
ToolBasedRawDigitPrepService:dtor: Time report for 7 tools.
ToolBasedRawDigitPrepService:dtor: digitReader: 0.13 sec/event
ToolBasedRawDigitPrepService:dtor: adcSampleFiller: 0.35 sec/event
ToolBasedRawDigitPrepService:dtor: adcScaleAdcToKe: 0.06 sec/event
ToolBasedRawDigitPrepService:dtor: pdspTailPedRemovalZKe: 4.55 sec/event
ToolBasedRawDigitPrepService:dtor: adcKeepAllSignalFinder: 0.18 sec/event
ToolBasedRawDigitPrepService:dtor: adcScaleKeToAdc: 0.07 sec/event
ToolBasedRawDigitPrepService:dtor: pdsp_RemoveBadChannels: 0.00 sec/event
Art has completed and will exit with status 0.
lar exit code 0
.:
total 11721236
-rw-r--r-- 1 dune01 dune01 2693899491 Nov 6 11:04 detsim_stage2.root
-rw-r--r-- 1 dune01 dune01 2557782173 Nov 6 11:01 detsim_stage1.root
-rw-r--r-- 1 dune01 dune01 2415087402 Nov 6 12:52 reco_stage1.root
-rw-r--r-- 1 dune01 dune01 2166180081 Nov 6 08:19 g4_stage2.root
-rw-r--r-- 1 dune01 dune01 2085135573 Nov 6 08:00 g4_stage1.root
-rw-r--r-- 1 dune01 dune01 83829920 Nov 6 12:45 Pandora_Events.pndr
-rw-r--r-- 1 dune01 dune01 243036 Nov 6 12:52 jobscript.log
-rw-r--r-- 1 dune01 dune01 217088 Nov 6 12:52 mem.db
-rw-r--r-- 1 dune01 dune01 62376 Nov 6 12:52 Pandora_Geometry.xml
-rw-r--r-- 1 dune01 dune01 36864 Nov 6 12:52 time.db
-rw-r--r-- 1 dune01 dune01 519 Nov 6 11:04 detsim_single_protoDUNE_hist.root
-rw-r--r-- 1 dune01 dune01 519 Nov 6 08:19 g4_protoDUNE_hist.root
-rw-r--r-- 1 dune01 dune01 519 Nov 6 12:52 protoDUNE_reco1_hist.root
-rw-r--r-- 1 dune01 dune01 52 Nov 6 07:51 all-input-dids.txt
-rw-r--r-- 1 dune01 dune01 7 Nov 6 12:52 justin-processed-pfns.txt
-rw-r--r-- 1 dune01 dune01 0 Nov 6 11:13 ProtoDUNE.log
-rw-r--r-- 1 dune01 dune01 0 Nov 6 11:04 debugprod.log
