justIN           Dashboard       Workflows       Jobs       AWT       Sites       Storages       Docs       Login

Jobsub ID 298749.1@dunegpschedd01.fnal.gov

Jobsub ID298749.1@dunegpschedd01.fnal.gov
Workflow ID12205
Stage ID1
User namepmelas@fnal.gov
RequestedProcessors1
GPUNo
RSS bytes8388608000 (8000 MiB)
Wall seconds limit86400 (24 hours)
Submitted time2026-01-21 21:22:13
SiteUK_QMUL
EntryDUNE_UK_London_QMUL_arcce02
Last heartbeat2026-01-22 02:22:01
From worker nodeHostnamecn098.htc.esc.qmul
cpuinfoIntel(R) Xeon(R) Gold 6248R CPU @ 3.00GHz
OS releaseScientific Linux release 7.9 (Nitrogen)
Processors1
RSS bytes10485760000 (10000 MiB)
Wall seconds limit171000 (47 hours)
GPU
Inner Apptainer?True
Job statefinished
Started2026-01-21 21:23:08
Input filesmonte-carlo-012205-000001
JobscriptExit code0
Real time4h (17706s)
CPU time4h (17434s = 98%)
Max RSS bytes4268515328 (4070 MiB)
Outputting started2026-01-22 02:18:15
Output fileshttps://fndcadoor.fnal.gov:2880/dune/scratch/users/pmelas/fnal/12205/1/001/reco_stage1.root
Finished2026-01-22 02:22:01
Saved logsjustin-logs:298749.1-dunegpschedd01.fnal.gov.logs.tgz
List job events     Cached HTCondor job logs

Jobscript log (last 10,000 characters)

ng 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 128812 traces, 0 summary
Retagger: tagging trace set: gauss with 101237 traces, 0 summary
wclsFrameSaver saving cooked to 6000 ticks
wclsFrameSaver: saving 101237 traces tagged "gauss"
FrameSaver: q=3.79197e+06 n=1816245 tag=gauss
wclsFrameSaver: saving 128812 traces tagged "wiener"
FrameSaver: q=4.00073e+06 n=1623717 tag=wiener
72 X, 28 U, 34 V bad channels
Finding XUV coincidences...
C:0 T:0 56777 XUs and 51541 XVs -> 762 XUVs
C:0 T:1 132343 XUs and 124299 XVs -> 8459 XUVs
C:0 T:2 54362 XUs and 55342 XVs -> 5919 XUVs
C:0 T:3 21351 XUs and 22597 XVs -> 407 XUVs
C:0 T:4 10239 XUs and 14616 XVs -> 158 XUVs
C:0 T:5 55273 XUs and 59282 XVs -> 9092 XUVs
C:0 T:6 106955 XUs and 129643 XVs -> 3647 XUVs
C:0 T:7 46015 XUs and 56023 XVs -> 432 XUVs
C:0 T:8 5319 XUs and 4910 XVs -> 47 XUVs
C:0 T:9 30302 XUs and 36930 XVs -> 4241 XUVs
C:0 T:10 21980 XUs and 17774 XVs -> 2152 XUVs
C:0 T:11 237 XUs and 258 XVs -> 22 XUVs
35338 XUVs total
10894 collection wire objects
32177 potential space points
Neighbour search...
3329907 tests to find 1569022 neighbours
Iterating with no regularization...
Begin: 9.78952e+07
0 8.31531e+07
1 8.20953e+07
2 8.1955e+07
3 8.19187e+07
Now with regularization...
Begin: 7.01391e+07
0 7.00864e+07
run: 1 ; subrun: 0 ; event: 10
evttime: 411884441
fLifetime: 30000 [us]
run: 1 ; subrun: 0 ; event: 10
evttime: 411884441
fLifetime: 30000 [us]
22-Jan-2026 02:18:12 GMT  Closed output file "reco_stage1.root"
22-Jan-2026 02:18:12 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                                          637.617       742.398       885.126       722.027       75.6048        10     
------------------------------------------------------------------------------------------------------------------------------------
source:RootInput(read)                            0.00134829     0.0040819    0.00670116    0.00428998    0.00161676       10     
reco:ophit:OpHitFinder                             0.412629      0.513722      0.605387      0.518982      0.0661932       10     
reco:opflash:OpFlashFinder                         0.219604      0.300038      0.349636      0.302193      0.0357395       10     
reco:opslicer:OpSlicer                             0.906669       1.04792       1.24122       1.05386      0.0819699       10     
reco:caldata:DataPrepModule                         6.04951       8.83685       10.0395       9.06086       1.0023         10     
reco:wclsdatasp:WireCellToolkit                     53.5941       60.9974       63.2092       61.6207       2.57612        10     
reco:gaushit:GausHitFinder                          1.55916       2.11033       2.43544       2.09924       0.25042        10     
reco:nhitsfilter:NumberOfHitsFilter               0.00082482    0.00104559    0.00118917    0.00102769    0.000108337      10     
reco:reco3d:SpacePointSolver                        20.5652       24.2963       29.4398       23.944        2.67291        10     
reco:hitpdune:DisambigFromSpacePoints               3.13174       3.90447       4.94323       3.85139      0.663831        10     
reco:pandora:StandardPandora                        54.3831       66.0365       82.321        65.2731       8.62159        10     
reco:pandoraWriter:StandardPandora                  0.72943      0.788382       0.87067      0.780477      0.0454701       10     
reco:pandoraTrack:LArPandoraTrackCreation           14.3243       17.7264       22.0461       17.7661       2.63332        10     
reco:pandoraShower:LArPandoraShowerCreation         14.7327       18.8179       26.3576       17.6343       3.35069        10     
reco:pandoracalo:Calorimetry                        5.34034       7.74091       9.74026       7.62814       1.32013        10     
reco:pandoracalonosce:Calorimetry                   5.0108        7.33295       10.5275       7.18801       1.4761         10     
reco:pandorapid:Chi2ParticleID                    0.00568617     0.0101987     0.0119321     0.0107745    0.00168862       10     
reco:pandoracalinoxyzt:CalibrationdEdXPDSP         0.0688907     0.0931516     0.106982      0.0908515     0.0109408       10     
reco:pandoracalipidnoxyzt:Chi2ParticleID          0.00569381    0.00979105     0.0116403     0.0101171    0.00173999       10     
reco:pandoraShowercalo:ShowerCalorimetry            14.2527       17.1325       23.6686       15.4296       3.00071        10     
reco:pandoraShowercalonosce:ShowerCalorimetry       12.5817       17.3053       25.417        16.5284       3.37724        10     
reco:emtrkmichelid:EmTrackMichelId                  236.579       326.649       375.992       331.045       37.7353        10     
reco:crttag:SingleCRTMatchingProducer              0.0346548     0.0431602     0.0559289     0.0410572    0.00658502       10     
reco:crtreco:TwoCRTMatchingProducer                0.0235855     0.031869      0.0370058     0.0323796    0.00437545       10     
reco:anodepiercerst0:T0RecoAnodePiercers            1.43176       1.77994       2.20012       1.77952      0.237547        10     
reco:pandora2Track:LArPandoraTrackCreation          46.6972       55.3953       69.9396       52.0654       8.29947        10     
reco:pandora2calo:Calorimetry                       16.8759       23.8558       32.7106       22.5857       4.40045        10     
reco:pandora2calonosce:Calorimetry                  15.8293       22.1791       29.7233       21.7057       3.89827        10     
reco:pandora2pid:Chi2ParticleID                    0.014011      0.0254856     0.0356337     0.0251693    0.00535044       10     
reco:pandora2calinoxyzt:CalibrationdEdXPDSP         0.11098       0.1281       0.175835      0.122705      0.017985        10     
reco:pandora2calipidnoxyzt:Chi2ParticleID          0.0218544     0.0250572     0.0297567     0.0244115    0.00247069       10     
reco:pandora2Shower:LArPandoraShowerCreation        13.4688       16.5745       19.9006       16.2049       2.21741        10     
reco:pandora2Showercalo:ShowerCalorimetry           17.1367       19.5154       23.0495       18.4962       2.23246        10     
reco:pandora2Showercalonosce:ShowerCalorimetry      12.7652       16.7838       23.0421       16.2286       3.06195        10     
[art]:TriggerResults:TriggerResultInserter        5.3692e-05    7.65617e-05   0.000147431   7.2171e-05    2.44948e-05      10     
end_path:out1:RootOutput                           7.942e-06    1.15121e-05   1.9051e-05    1.08125e-05   3.22195e-06      10     
end_path:out1:RootOutput(write)                     3.89121       4.2193        4.89854       4.03612      0.335351        10     
====================================================================================================================================

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

  Peak virtual memory usage (VmPeak)  : 5075.08 MB
  Peak resident set size usage (VmHWM): 4268.52 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.10 sec/event
ToolBasedRawDigitPrepService:dtor:                adcSampleFiller:   0.33 sec/event
ToolBasedRawDigitPrepService:dtor:                adcScaleAdcToKe:   0.06 sec/event
ToolBasedRawDigitPrepService:dtor:          pdspTailPedRemovalZKe:   5.32 sec/event
ToolBasedRawDigitPrepService:dtor:         adcKeepAllSignalFinder:   0.31 sec/event
ToolBasedRawDigitPrepService:dtor:                adcScaleKeToAdc:   0.06 sec/event
ToolBasedRawDigitPrepService:dtor:         pdsp_RemoveBadChannels:   0.01 sec/event
Art has completed and will exit with status 0.
lar exit code 0
.:
total 11225272
-rw-r--r-- 1 pildune22 pildune 2589202467 Jan 22 00:11 detsim_stage2.root
-rw-r--r-- 1 pildune22 pildune 2452897943 Jan 22 00:07 detsim_stage1.root
-rw-r--r-- 1 pildune22 pildune 2310510502 Jan 22 02:18 reco_stage1.root
-rw-r--r-- 1 pildune22 pildune 2071298823 Jan 21 21:54 g4_stage2.root
-rw-r--r-- 1 pildune22 pildune 1986776686 Jan 21 21:31 g4_stage1.root
-rw-r--r-- 1 pildune22 pildune   83375400 Jan 22 02:09 Pandora_Events.pndr
-rw-r--r-- 1 pildune22 pildune     242806 Jan 22 02:18 jobscript.log
-rw-r--r-- 1 pildune22 pildune     217088 Jan 22 02:18 mem.db
-rw-r--r-- 1 pildune22 pildune      62376 Jan 22 02:18 Pandora_Geometry.xml
-rw-r--r-- 1 pildune22 pildune      36864 Jan 22 02:18 time.db
-rw-r--r-- 1 pildune22 pildune        519 Jan 22 00:11 detsim_single_protoDUNE_hist.root
-rw-r--r-- 1 pildune22 pildune        519 Jan 21 21:54 g4_protoDUNE_hist.root
-rw-r--r-- 1 pildune22 pildune        519 Jan 22 02:18 protoDUNE_reco1_hist.root
-rw-r--r-- 1 pildune22 pildune         52 Jan 21 21:23 all-input-dids.txt
-rw-r--r-- 1 pildune22 pildune          7 Jan 22 02:18 justin-processed-pfns.txt
-rw-r--r-- 1 pildune22 pildune          0 Jan 22 00:21 ProtoDUNE.log
-rw-r--r-- 1 pildune22 pildune          0 Jan 22 00:11 debugprod.log
justIN time: 2026-02-05 11:17:55 UTC       justIN version: 01.06.00