justIN           Dashboard       Workflows       Jobs       AWT       Sites       Storages       Docs       Login

Jobsub ID 19955.1@dunegpschedd01.fnal.gov

Jobsub ID19955.1@dunegpschedd01.fnal.gov
Workflow ID171
Stage ID1
User namepmelas@fnal.gov
HTCondor Groupgroup_dune
RequestedProcessors1
GPUNo
RSS bytes8388608000 (8000 MiB)
Wall seconds limit86400 (24 hours)
Submitted time2025-07-31 21:11:20
SiteNL_SURFsara
EntryDUNE_SurfSARA_arc02
Last heartbeat2025-08-01 00:57:16
From worker nodeHostnamewn-la-17.gina.surf.nl
cpuinfoAMD EPYC 9754 128-Core Processor
OS releaseScientific Linux release 7.9 (Nitrogen)
Processors1
RSS bytes10485760000 (10000 MiB)
Wall seconds limit129600 (36 hours)
GPU
Inner Apptainer?True
Job statefinished
Started2025-07-31 21:13:06
Input filesmonte-carlo-000171-000001
JobscriptExit code0
Real time3h (13340s)
CPU time3h (13077s = 98%)
Max RSS bytes3978018816 (3793 MiB)
Outputting started2025-08-01 00:55:28
Output fileshttps://fndcadoor.fnal.gov:2880/dune/scratch/users/pmelas/fnal/00171/1/001/reco_stage1.root
Finished2025-08-01 00:57:16
Saved logsjustin-logs:19955.1-dunegpschedd01.fnal.gov.logs.tgz
List job events     Cached HTCondor job logs

Jobscript log (last 10,000 characters)

eepAllSignalFinder
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 135379 traces, 0 summary
Retagger: tagging trace set: gauss with 103994 traces, 0 summary
wclsFrameSaver saving cooked to 6000 ticks
wclsFrameSaver: saving 103994 traces tagged "gauss"
FrameSaver: q=3.58606e+06 n=1835443 tag=gauss
wclsFrameSaver: saving 135379 traces tagged "wiener"
FrameSaver: q=3.78588e+06 n=1626726 tag=wiener
72 X, 28 U, 34 V bad channels
Finding XUV coincidences...
C:0 T:0 37040 XUs and 35730 XVs -> 572 XUVs
C:0 T:1 97596 XUs and 82096 XVs -> 12184 XUVs
C:0 T:2 83593 XUs and 91778 XVs -> 3850 XUVs
C:0 T:3 41173 XUs and 37858 XVs -> 237 XUVs
C:0 T:4 11564 XUs and 9817 XVs -> 160 XUVs
C:0 T:5 119414 XUs and 83226 XVs -> 34073 XUVs
C:0 T:6 112560 XUs and 126121 XVs -> 6148 XUVs
C:0 T:7 45676 XUs and 51302 XVs -> 615 XUVs
C:0 T:8 7944 XUs and 8042 XVs -> 81 XUVs
C:0 T:9 77255 XUs and 89374 XVs -> 11414 XUVs
C:0 T:10 35170 XUs and 37249 XVs -> 8726 XUVs
C:0 T:11 240 XUs and 185 XVs -> 57 XUVs
78117 XUVs total
12825 collection wire objects
74706 potential space points
Neighbour search...
23432990 tests to find 9067888 neighbours
Iterating with no regularization...
Begin: 8.24965e+07
0 7.21595e+07
1 7.13673e+07
2 7.12551e+07
3 7.12211e+07
Now with regularization...
Begin: 6.05589e+07
0 6.05187e+07
run: 1 ; subrun: 0 ; event: 10
evttime: 408381167
fLifetime: 30000 [us]
run: 1 ; subrun: 0 ; event: 10
evttime: 408381167
fLifetime: 30000 [us]
01-Aug-2025 02:55:25 CEST  Closed output file "reco_stage1.root"
01-Aug-2025 02:55:25 CEST  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                                          285.124       394.383       515.337       399.117       72.1316        10     
------------------------------------------------------------------------------------------------------------------------------------
source:RootInput(read)                            0.00119125     0.0053914    0.00798012    0.00533379    0.00206538       10     
reco:ophit:OpHitFinder                             0.288543      0.364128       0.40661      0.387334      0.0469104       10     
reco:opflash:OpFlashFinder                         0.173578       0.22387       0.27975      0.223167      0.0360883       10     
reco:opslicer:OpSlicer                             0.559089      0.757365      0.935821      0.776333      0.110733        10     
reco:caldata:DataPrepModule                         4.83233       6.01792       7.01291       6.3396       0.789974        10     
reco:wclsdatasp:WireCellToolkit                     43.3583       52.1113       63.3676       49.7257       6.70916        10     
reco:gaushit:GausHitFinder                         0.946114       1.25923       1.76565       1.2371       0.233373        10     
reco:nhitsfilter:NumberOfHitsFilter               0.000327779   0.00060715    0.00100817    0.000584804   0.000200809      10     
reco:reco3d:SpacePointSolver                        9.9579        19.3836        36.47        18.7553       7.36735        10     
reco:hitpdune:DisambigFromSpacePoints              0.948953       1.60984       2.72636       1.41763      0.492625        10     
reco:pandora:StandardPandora                         17.75        35.0194       60.7904       34.2092       11.7367        10     
reco:pandoraWriter:StandardPandora                 0.332394      0.472196      0.695639      0.482437      0.102762        10     
reco:pandoraTrack:LArPandoraTrackCreation           2.55882       6.44903       14.8203       6.13913       3.25367        10     
reco:pandoraShower:LArPandoraShowerCreation         3.30616       7.54515       16.1238       7.1491        3.54847        10     
reco:pandoracalo:Calorimetry                        1.33747       3.19643       5.79215       3.17576       1.13772        10     
reco:pandoracalonosce:Calorimetry                   1.21646       3.10611       5.11365       2.97034       1.11288        10     
reco:pandorapid:Chi2ParticleID                    0.00376229    0.00566257    0.00730473    0.00565585     0.0010802       10     
reco:pandoracalinoxyzt:CalibrationdEdXPDSP         0.0324435     0.0499398     0.0619829     0.0515336    0.00919734       10     
reco:pandoracalipidnoxyzt:Chi2ParticleID          0.00380086    0.00541673    0.00706788    0.00540926    0.000926666      10     
reco:pandoraShowercalo:ShowerCalorimetry            2.67891       7.35496       11.9123       6.79034       2.94211        10     
reco:pandoraShowercalonosce:ShowerCalorimetry       2.68957       6.55474       11.264        5.84028       2.65166        10     
reco:emtrkmichelid:EmTrackMichelId                  128.837       182.329       223.872       183.833       29.8716        10     
reco:crttag:SingleCRTMatchingProducer              0.0107634     0.0186165      0.02624      0.0188956    0.00598914       10     
reco:crtreco:TwoCRTMatchingProducer               0.00809341     0.0137436     0.0227568     0.0121454    0.00419347       10     
reco:anodepiercerst0:T0RecoAnodePiercers           0.650351      0.940216       1.29151      0.895515      0.183656        10     
reco:pandora2Track:LArPandoraTrackCreation          10.2921       19.0083       27.9476       16.9356       6.63212        10     
reco:pandora2calo:Calorimetry                       4.32339       9.22731       14.5217       9.22718       3.2873         10     
reco:pandora2calonosce:Calorimetry                  4.05606       8.67816       13.8589       8.88389       3.13604        10     
reco:pandora2pid:Chi2ParticleID                   0.00815803     0.0125674     0.015872      0.0129138    0.00255742       10     
reco:pandora2calinoxyzt:CalibrationdEdXPDSP        0.0432603     0.062431      0.0819199     0.066554      0.0128555       10     
reco:pandora2calipidnoxyzt:Chi2ParticleID         0.00809201     0.0126718     0.0160829     0.0129029    0.00255972       10     
reco:pandora2Shower:LArPandoraShowerCreation        3.33143       6.20445       9.3178        6.38244       1.96923        10     
reco:pandora2Showercalo:ShowerCalorimetry           3.36471       7.09492       11.0734       7.22536       2.40507        10     
reco:pandora2Showercalonosce:ShowerCalorimetry      2.90354       5.94664       9.6864        6.08925       1.91727        10     
[art]:TriggerResults:TriggerResultInserter        3.1547e-05    4.64372e-05   0.000129383   3.65445e-05   2.79398e-05      10     
end_path:out1:RootOutput                           6.39e-06     7.7235e-06    1.4832e-05     6.755e-06    2.41979e-06      10     
end_path:out1:RootOutput(write)                     2.17141       3.10377       3.93702       3.12883      0.584578        10     
====================================================================================================================================

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

  Peak virtual memory usage (VmPeak)  : 4779.04 MB
  Peak resident set size usage (VmHWM): 3978.02 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.07 sec/event
ToolBasedRawDigitPrepService:dtor:                adcSampleFiller:   0.27 sec/event
ToolBasedRawDigitPrepService:dtor:                adcScaleAdcToKe:   0.04 sec/event
ToolBasedRawDigitPrepService:dtor:          pdspTailPedRemovalZKe:   3.72 sec/event
ToolBasedRawDigitPrepService:dtor:         adcKeepAllSignalFinder:   0.15 sec/event
ToolBasedRawDigitPrepService:dtor:                adcScaleKeToAdc:   0.04 sec/event
ToolBasedRawDigitPrepService:dtor:         pdsp_RemoveBadChannels:   0.00 sec/event
Art has completed and will exit with status 0.
lar exit code 0
.:
total 9610764
-rw-r--r--. 1 dune003 dune 2278099518 Aug  1 01:47 detsim_stage2.root
-rw-r--r--. 1 dune003 dune 2159946285 Aug  1 01:45 detsim_stage1.root
-rw-r--r--. 1 dune003 dune 1966958883 Aug  1 02:55 reco_stage1.root
-rw-r--r--. 1 dune003 dune 1719564550 Jul 31 23:34 g4_stage2.root
-rw-r--r--. 1 dune003 dune 1640978718 Jul 31 23:20 g4_stage1.root
-rw-r--r--. 1 dune003 dune   75256410 Aug  1 02:50 Pandora_Events.pndr
-rw-r--r--. 1 dune003 dune     242993 Aug  1 02:55 jobscript.log
-rw-r--r--. 1 dune003 dune     217088 Aug  1 02:55 mem.db
-rw-r--r--. 1 dune003 dune      62376 Aug  1 02:55 Pandora_Geometry.xml
-rw-r--r--. 1 dune003 dune      36864 Aug  1 02:55 time.db
-rw-r--r--. 1 dune003 dune        519 Aug  1 01:47 detsim_single_protoDUNE_hist.root
-rw-r--r--. 1 dune003 dune        519 Jul 31 23:34 g4_protoDUNE_hist.root
-rw-r--r--. 1 dune003 dune        519 Aug  1 02:55 protoDUNE_reco1_hist.root
-rw-r--r--. 1 dune003 dune         52 Jul 31 23:13 all-input-dids.txt
-rw-r--r--. 1 dune003 dune          7 Aug  1 02:55 justin-processed-pfns.txt
-rw-r--r--. 1 dune003 dune          0 Aug  1 01:54 ProtoDUNE.log
-rw-r--r--. 1 dune003 dune          0 Aug  1 01:47 debugprod.log
justIN time: 2025-08-04 22:46:18 UTC       justIN version: 01.04.00