justIN           Dashboard       Workflows       Jobs       AWT       Sites       Storages       Docs       Login

Jobsub ID 246862.1@dunegpschedd02.fnal.gov

Jobsub ID246862.1@dunegpschedd02.fnal.gov
Workflow ID10246
Stage ID1
User namepmelas@fnal.gov
RequestedProcessors1
GPUNo
RSS bytes8388608000 (8000 MiB)
Wall seconds limit86400 (24 hours)
Submitted time2025-11-16 04:30:39
SiteUK_QMUL
EntryDUNE_UK_London_QMUL_arcce02
Last heartbeat2025-11-16 09:18:29
From worker nodeHostnamecn091.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
Started2025-11-16 04:31:45
Input filesmonte-carlo-010246-000001
JobscriptExit code0
Real time4h (16914s)
CPU time4h (16640s = 98%)
Max RSS bytes4112293888 (3921 MiB)
Outputting started2025-11-16 09:13:40
Output fileshttps://fndcadoor.fnal.gov:2880/dune/scratch/users/pmelas/fnal/10246/1/001/reco_stage1.root
Finished2025-11-16 09:18:29
Saved logsjustin-logs:246862.1-dunegpschedd02.fnal.gov.logs.tgz
List job events     Cached HTCondor job logs

Jobscript log (last 10,000 characters)

1 event 10 with 7 tools.
CookedFrameSource: got 15360 recob::Wire objects
	input nticks=6000 keeping as is
Retagger: tagging trace set: wiener with 146198 traces, 0 summary
Retagger: tagging trace set: gauss with 112364 traces, 0 summary
wclsFrameSaver saving cooked to 6000 ticks
wclsFrameSaver: saving 112364 traces tagged "gauss"
FrameSaver: q=3.90467e+06 n=2038235 tag=gauss
wclsFrameSaver: saving 146198 traces tagged "wiener"
FrameSaver: q=4.1322e+06 n=1817292 tag=wiener
72 X, 28 U, 34 V bad channels
Finding XUV coincidences...
C:0 T:0 22456 XUs and 25374 XVs -> 184 XUVs
C:0 T:1 36939 XUs and 37308 XVs -> 2148 XUVs
C:0 T:2 127826 XUs and 141413 XVs -> 6102 XUVs
C:0 T:3 56278 XUs and 53619 XVs -> 439 XUVs
C:0 T:4 9408 XUs and 12257 XVs -> 160 XUVs
C:0 T:5 36945 XUs and 46713 XVs -> 5964 XUVs
C:0 T:6 128043 XUs and 131760 XVs -> 8041 XUVs
C:0 T:7 44715 XUs and 49384 XVs -> 460 XUVs
C:0 T:8 9460 XUs and 7114 XVs -> 92 XUVs
C:0 T:9 50303 XUs and 49997 XVs -> 4038 XUVs
C:0 T:10 115356 XUs and 84595 XVs -> 13102 XUVs
C:0 T:11 357 XUs and 186 XVs -> 18 XUVs
40748 XUVs total
13805 collection wire objects
37868 potential space points
Neighbour search...
3004860 tests to find 1559426 neighbours
Iterating with no regularization...
Begin: 9.96215e+07
0 6.82802e+07
1 6.64367e+07
2 6.62475e+07
3 6.61937e+07
Now with regularization...
Begin: 5.48735e+07
0 5.48276e+07
BdtBeamParticleIdTool::SliceFeatures::GetLeadingCaloHits - empty calo hit list
BdtBeamParticleIdTool::SliceFeatures::GetLeadingCaloHits - empty calo hit list
run: 1 ; subrun: 0 ; event: 10
evttime: 410542552
fLifetime: 30000 [us]
run: 1 ; subrun: 0 ; event: 10
evttime: 410542552
fLifetime: 30000 [us]
16-Nov-2025 09:13:36 GMT  Closed output file "reco_stage1.root"
16-Nov-2025 09:13:36 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                                          395.269       630.296       895.234       626.935       143.477        10     
------------------------------------------------------------------------------------------------------------------------------------
source:RootInput(read)                            0.00165898    0.00475813    0.00724294     0.0045631     0.0015307       10     
reco:ophit:OpHitFinder                             0.251641      0.357851       0.49081      0.352671      0.0767406       10     
reco:opflash:OpFlashFinder                         0.180602      0.223561      0.305936      0.207461      0.0422935       10     
reco:opslicer:OpSlicer                             0.583183      0.853281       1.2611       0.826273      0.210187        10     
reco:caldata:DataPrepModule                         5.67974       7.87351       9.21061       8.29389       1.29835        10     
reco:wclsdatasp:WireCellToolkit                     49.2055       61.1447       74.6708       60.9351       8.3789         10     
reco:gaushit:GausHitFinder                          1.31725       1.75284       2.44405       1.72922      0.334911        10     
reco:nhitsfilter:NumberOfHitsFilter               0.000692177   0.00100412    0.00141704    0.000988919   0.000190545      10     
reco:reco3d:SpacePointSolver                        7.12036       19.266        32.8017       18.1214        7.075         10     
reco:hitpdune:DisambigFromSpacePoints               1.02104       2.99188       5.10412       2.70958       1.16986        10     
reco:pandora:StandardPandora                        16.9009       46.8445       102.493       41.3206       22.7467        10     
reco:pandoraWriter:StandardPandora                 0.355671      0.637884       0.90984      0.644669      0.157243        10     
reco:pandoraTrack:LArPandoraTrackCreation           5.2816         12.26        19.0813       11.8448       4.10237        10     
reco:pandoraShower:LArPandoraShowerCreation         4.75445       15.0585       24.0018       15.5106       5.29084        10     
reco:pandoracalo:Calorimetry                        2.2735        5.78597       9.30817       5.77745       2.11219        10     
reco:pandoracalonosce:Calorimetry                   2.12432       5.54079       8.88981       5.61522       2.03381        10     
reco:pandorapid:Chi2ParticleID                     0.0041439    0.00870591     0.0137869    0.00863042    0.00287117       10     
reco:pandoracalinoxyzt:CalibrationdEdXPDSP         0.0418208     0.0888474     0.134648      0.0868213     0.0245275       10     
reco:pandoracalipidnoxyzt:Chi2ParticleID          0.00397638    0.00798854     0.0122577     0.0082912    0.00243205       10     
reco:pandoraShowercalo:ShowerCalorimetry            4.06192       14.5915       24.0116       14.605        5.92554        10     
reco:pandoraShowercalonosce:ShowerCalorimetry       3.34922       14.302        23.7964       14.209        5.86902        10     
reco:emtrkmichelid:EmTrackMichelId                  223.267       284.259       375.49        278.932       56.2634        10     
reco:crttag:SingleCRTMatchingProducer              0.0253988     0.0407479     0.0567503     0.0408785     0.0105865       10     
reco:crtreco:TwoCRTMatchingProducer                0.0181848     0.0328065     0.0503912     0.034595     0.00935634       10     
reco:anodepiercerst0:T0RecoAnodePiercers           0.916854       1.4801        1.96652       1.43966      0.321963        10     
reco:pandora2Track:LArPandoraTrackCreation          16.8019       45.5262       67.368        49.3088       14.9541        10     
reco:pandora2calo:Calorimetry                       6.90275       20.472        30.0674       23.0667       7.62604        10     
reco:pandora2calonosce:Calorimetry                  5.55886       19.4042       28.4106       22.1588       7.60185        10     
reco:pandora2pid:Chi2ParticleID                   0.00874004     0.0202124     0.0296571     0.0219823    0.00643548       10     
reco:pandora2calinoxyzt:CalibrationdEdXPDSP        0.056863      0.106741      0.142383      0.114688      0.0273988       10     
reco:pandora2calipidnoxyzt:Chi2ParticleID         0.00863755     0.0195312     0.0280955     0.0219707    0.00627238       10     
reco:pandora2Shower:LArPandoraShowerCreation        3.76812       14.103        21.3959       15.2603       5.36932        10     
reco:pandora2Showercalo:ShowerCalorimetry           4.44694       16.6161       25.5589       17.6471       6.63268        10     
reco:pandora2Showercalonosce:ShowerCalorimetry      3.70291       14.6762       24.0289       15.9819       6.13514        10     
[art]:TriggerResults:TriggerResultInserter        7.2611e-05    0.000107865   0.000189102   9.5435e-05    3.4203e-05       10     
end_path:out1:RootOutput                          1.0316e-05    1.49831e-05   2.0798e-05    1.4734e-05     2.824e-06       10     
end_path:out1:RootOutput(write)                     2.19636       3.72959       4.97321        4.046       0.927108        10     
====================================================================================================================================

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

  Peak virtual memory usage (VmPeak)  : 4919.71 MB
  Peak resident set size usage (VmHWM): 4112.29 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.12 sec/event
ToolBasedRawDigitPrepService:dtor:                adcSampleFiller:   0.32 sec/event
ToolBasedRawDigitPrepService:dtor:                adcScaleAdcToKe:   0.06 sec/event
ToolBasedRawDigitPrepService:dtor:          pdspTailPedRemovalZKe:   4.83 sec/event
ToolBasedRawDigitPrepService:dtor:         adcKeepAllSignalFinder:   0.27 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 9825936
-rw-r--r-- 1 pildune22 pildune 2318003214 Nov 16 07:25 detsim_stage2.root
-rw-r--r-- 1 pildune22 pildune 2199568321 Nov 16 07:23 detsim_stage1.root
-rw-r--r-- 1 pildune22 pildune 1995419329 Nov 16 09:13 reco_stage1.root
-rw-r--r-- 1 pildune22 pildune 1779920704 Nov 16 05:04 g4_stage2.root
-rw-r--r-- 1 pildune22 pildune 1695763166 Nov 16 04:40 g4_stage1.root
-rw-r--r-- 1 pildune22 pildune   72474730 Nov 16 09:02 Pandora_Events.pndr
-rw-r--r-- 1 pildune22 pildune     242906 Nov 16 09:13 jobscript.log
-rw-r--r-- 1 pildune22 pildune     217088 Nov 16 09:13 mem.db
-rw-r--r-- 1 pildune22 pildune      62376 Nov 16 09:13 Pandora_Geometry.xml
-rw-r--r-- 1 pildune22 pildune      36864 Nov 16 09:13 time.db
-rw-r--r-- 1 pildune22 pildune        519 Nov 16 07:25 detsim_single_protoDUNE_hist.root
-rw-r--r-- 1 pildune22 pildune        519 Nov 16 05:04 g4_protoDUNE_hist.root
-rw-r--r-- 1 pildune22 pildune        519 Nov 16 09:13 protoDUNE_reco1_hist.root
-rw-r--r-- 1 pildune22 pildune         52 Nov 16 04:31 all-input-dids.txt
-rw-r--r-- 1 pildune22 pildune          7 Nov 16 09:13 justin-processed-pfns.txt
-rw-r--r-- 1 pildune22 pildune          0 Nov 16 07:36 ProtoDUNE.log
-rw-r--r-- 1 pildune22 pildune          0 Nov 16 07:25 debugprod.log
justIN time: 2026-02-09 10:51:28 UTC       justIN version: 01.06.00