justIN           Dashboard       Workflows       Jobs       AWT       Sites       Storages       Docs       Login

Jobsub ID 236769.3@dunegpschedd02.fnal.gov

Jobsub ID236769.3@dunegpschedd02.fnal.gov
Workflow ID9557
Stage ID1
User nameimawby@fnal.gov
HTCondor Groupgroup_dune
RequestedProcessors1
GPUNo
RSS bytes4194304000 (4000 MiB)
Wall seconds limit43200 (12 hours)
Submitted time2025-11-03 17:03:05
SiteCERN
EntryCMSHTPC_T2_CH_CERN_ce509
Last heartbeat2025-11-03 17:20:50
From worker nodeHostnameb9p06p1726.cern.ch
cpuinfoAMD EPYC 7543 32-Core Processor
OS releaseScientific Linux release 7.9 (Nitrogen)
Processors1
RSS bytes4194304000 (4000 MiB)
Wall seconds limit343800 (95 hours)
GPU
Inner Apptainer?True
Job statefinished
Started2025-11-03 17:09:58
Input filesfardet-hd:nu_dune10kt_1x2x6_1408_660_20230826T093906Z_gen_g4_detsim_hitreco__20240229T181838Z_reco2.root
JobscriptExit code0
Real time10m (628s)
CPU time4m (288s = 45%)
Max RSS bytes1299156992 (1238 MiB)
Outputting started2025-11-03 17:20:28
Output fileshttps://fndcadoor.fnal.gov:2880/dune/scratch/users/imawby/splitting_nu_2/fnal/09557/1/001/CheatingKalmanSplittingU_nu_dune10kt_1x2x6_1408_660_20230826T093906Z_gen_g4_detsim_hitreco__20240229T181838Z_reco2.root
Finished2025-11-03 17:20:50
Saved logsjustin-logs:236769.3-dunegpschedd02.fnal.gov.logs.tgz
List job events     Cached HTCondor job logs

Jobscript log (last 10,000 characters)

------------------------
Input PFN = root://xrootd.echo.stfc.ac.uk:1094/dune:/protodune/RSE/fardet-hd/98/fb/nu_dune10kt_1x2x6_1408_660_20230826T093906Z_gen_g4_detsim_hitreco__20240229T181838Z_reco2.root
lar exit code 0
=== Start last 100 lines of lar log file ===
Begin processing the 33rd record. run: 1408 subRun: 1 event: 66033 at 03-Nov-2025 18:15:43 CET
Begin processing the 34th record. run: 1408 subRun: 1 event: 66034 at 03-Nov-2025 18:15:47 CET
Begin processing the 35th record. run: 1408 subRun: 1 event: 66035 at 03-Nov-2025 18:15:51 CET
Begin processing the 36th record. run: 1408 subRun: 1 event: 66036 at 03-Nov-2025 18:15:55 CET
Begin processing the 37th record. run: 1408 subRun: 1 event: 66037 at 03-Nov-2025 18:15:59 CET
Begin processing the 38th record. run: 1408 subRun: 1 event: 66038 at 03-Nov-2025 18:16:03 CET
Begin processing the 39th record. run: 1408 subRun: 1 event: 66039 at 03-Nov-2025 18:16:07 CET
Begin processing the 40th record. run: 1408 subRun: 1 event: 66040 at 03-Nov-2025 18:16:12 CET
Begin processing the 41st record. run: 1408 subRun: 1 event: 66041 at 03-Nov-2025 18:16:17 CET
Begin processing the 42nd record. run: 1408 subRun: 1 event: 66042 at 03-Nov-2025 18:16:22 CET
Begin processing the 43rd record. run: 1408 subRun: 1 event: 66043 at 03-Nov-2025 18:16:25 CET
Begin processing the 44th record. run: 1408 subRun: 1 event: 66044 at 03-Nov-2025 18:16:29 CET
Begin processing the 45th record. run: 1408 subRun: 1 event: 66045 at 03-Nov-2025 18:16:38 CET
Begin processing the 46th record. run: 1408 subRun: 1 event: 66046 at 03-Nov-2025 18:16:42 CET
Begin processing the 47th record. run: 1408 subRun: 1 event: 66047 at 03-Nov-2025 18:16:46 CET
PandoraContentApi::GetList(*this, m_inputHitListName, pCaloHitList) return STATUS_CODE_NOT_INITIALIZED
    in function: GetVolumeIdToHitListMap
    in file:     /exp/dune/app/users/imawby/dunesw_splitting/srcs/larpandoracontent/larpandoracontent/LArControlFlow/MasterAlgorithm.cc line#: 271
this->GetVolumeIdToHitListMap(volumeIdToHitListMap) return STATUS_CODE_NOT_INITIALIZED
    in function: Run
    in file:     /exp/dune/app/users/imawby/dunesw_splitting/srcs/larpandoracontent/larpandoracontent/LArControlFlow/MasterAlgorithm.cc line#: 165
iter->second->Run() throw STATUS_CODE_NOT_INITIALIZED
    in function: RunAlgorithm
    in file:     /scratch/workspace/build-larbase/BUILDTYPE/prof/QUAL/s131-e26/label1/swarm/label2/SLF7/build/pandora/v03_16_00l/src/pandora-v03-16-00/PandoraSDK-v03-04-01/src/Api/PandoraContentApiImpl.cc line#: 235
Failure in algorithm Alg0002, LArDLMaster, STATUS_CODE_NOT_INITIALIZED
Begin processing the 48th record. run: 1408 subRun: 1 event: 66048 at 03-Nov-2025 18:16:47 CET
Begin processing the 49th record. run: 1408 subRun: 1 event: 66049 at 03-Nov-2025 18:16:53 CET
Begin processing the 50th record. run: 1408 subRun: 1 event: 66050 at 03-Nov-2025 18:16:57 CET
Begin processing the 51st record. run: 1408 subRun: 1 event: 66051 at 03-Nov-2025 18:17:00 CET
Begin processing the 52nd record. run: 1408 subRun: 1 event: 66052 at 03-Nov-2025 18:17:05 CET
Begin processing the 53rd record. run: 1408 subRun: 1 event: 66053 at 03-Nov-2025 18:17:08 CET
Begin processing the 54th record. run: 1408 subRun: 1 event: 66054 at 03-Nov-2025 18:17:12 CET
Begin processing the 55th record. run: 1408 subRun: 1 event: 66055 at 03-Nov-2025 18:17:17 CET
Begin processing the 56th record. run: 1408 subRun: 1 event: 66056 at 03-Nov-2025 18:17:21 CET
Begin processing the 57th record. run: 1408 subRun: 1 event: 66057 at 03-Nov-2025 18:17:26 CET
Begin processing the 58th record. run: 1408 subRun: 1 event: 66058 at 03-Nov-2025 18:17:30 CET
Begin processing the 59th record. run: 1408 subRun: 1 event: 66059 at 03-Nov-2025 18:17:33 CET
Begin processing the 60th record. run: 1408 subRun: 1 event: 66060 at 03-Nov-2025 18:17:37 CET
Begin processing the 61st record. run: 1408 subRun: 1 event: 66061 at 03-Nov-2025 18:17:41 CET
Begin processing the 62nd record. run: 1408 subRun: 1 event: 66062 at 03-Nov-2025 18:17:44 CET
Begin processing the 63rd record. run: 1408 subRun: 1 event: 66063 at 03-Nov-2025 18:17:49 CET
Begin processing the 64th record. run: 1408 subRun: 1 event: 66064 at 03-Nov-2025 18:17:53 CET
Begin processing the 65th record. run: 1408 subRun: 1 event: 66065 at 03-Nov-2025 18:17:57 CET
Begin processing the 66th record. run: 1408 subRun: 1 event: 66066 at 03-Nov-2025 18:18:01 CET
Begin processing the 67th record. run: 1408 subRun: 1 event: 66067 at 03-Nov-2025 18:18:05 CET
Begin processing the 68th record. run: 1408 subRun: 1 event: 66068 at 03-Nov-2025 18:18:08 CET
Begin processing the 69th record. run: 1408 subRun: 1 event: 66069 at 03-Nov-2025 18:18:11 CET
Begin processing the 70th record. run: 1408 subRun: 1 event: 66070 at 03-Nov-2025 18:18:15 CET
Begin processing the 71st record. run: 1408 subRun: 1 event: 66071 at 03-Nov-2025 18:18:18 CET
Begin processing the 72nd record. run: 1408 subRun: 1 event: 66072 at 03-Nov-2025 18:18:22 CET
Begin processing the 73rd record. run: 1408 subRun: 1 event: 66073 at 03-Nov-2025 18:18:25 CET
Begin processing the 74th record. run: 1408 subRun: 1 event: 66074 at 03-Nov-2025 18:18:32 CET
Begin processing the 75th record. run: 1408 subRun: 1 event: 66075 at 03-Nov-2025 18:18:36 CET
Begin processing the 76th record. run: 1408 subRun: 1 event: 66076 at 03-Nov-2025 18:18:39 CET
Begin processing the 77th record. run: 1408 subRun: 1 event: 66077 at 03-Nov-2025 18:18:44 CET
Begin processing the 78th record. run: 1408 subRun: 1 event: 66078 at 03-Nov-2025 18:18:48 CET
Begin processing the 79th record. run: 1408 subRun: 1 event: 66079 at 03-Nov-2025 18:18:51 CET
Begin processing the 80th record. run: 1408 subRun: 1 event: 66080 at 03-Nov-2025 18:18:55 CET
Begin processing the 81st record. run: 1408 subRun: 1 event: 66081 at 03-Nov-2025 18:18:59 CET
Begin processing the 82nd record. run: 1408 subRun: 1 event: 66082 at 03-Nov-2025 18:19:03 CET
Begin processing the 83rd record. run: 1408 subRun: 1 event: 66083 at 03-Nov-2025 18:19:08 CET
Begin processing the 84th record. run: 1408 subRun: 1 event: 66084 at 03-Nov-2025 18:19:12 CET
Begin processing the 85th record. run: 1408 subRun: 1 event: 66085 at 03-Nov-2025 18:19:15 CET
Begin processing the 86th record. run: 1408 subRun: 1 event: 66086 at 03-Nov-2025 18:19:19 CET
Begin processing the 87th record. run: 1408 subRun: 1 event: 66087 at 03-Nov-2025 18:19:23 CET
Begin processing the 88th record. run: 1408 subRun: 1 event: 66088 at 03-Nov-2025 18:19:27 CET
Begin processing the 89th record. run: 1408 subRun: 1 event: 66089 at 03-Nov-2025 18:19:31 CET
Begin processing the 90th record. run: 1408 subRun: 1 event: 66090 at 03-Nov-2025 18:19:35 CET
Begin processing the 91st record. run: 1408 subRun: 1 event: 66091 at 03-Nov-2025 18:19:39 CET
Begin processing the 92nd record. run: 1408 subRun: 1 event: 66092 at 03-Nov-2025 18:19:42 CET
Begin processing the 93rd record. run: 1408 subRun: 1 event: 66093 at 03-Nov-2025 18:19:47 CET
Begin processing the 94th record. run: 1408 subRun: 1 event: 66094 at 03-Nov-2025 18:19:51 CET
Begin processing the 95th record. run: 1408 subRun: 1 event: 66095 at 03-Nov-2025 18:19:57 CET
Begin processing the 96th record. run: 1408 subRun: 1 event: 66096 at 03-Nov-2025 18:20:02 CET
Begin processing the 97th record. run: 1408 subRun: 1 event: 66097 at 03-Nov-2025 18:20:10 CET
Begin processing the 98th record. run: 1408 subRun: 1 event: 66098 at 03-Nov-2025 18:20:14 CET
Begin processing the 99th record. run: 1408 subRun: 1 event: 66099 at 03-Nov-2025 18:20:19 CET
Begin processing the 100th record. run: 1408 subRun: 1 event: 66100 at 03-Nov-2025 18:20:23 CET
03-Nov-2025 18:20:26 CET  Closed output file "nu_dune10kt_1x2x6_1408_660_20230826T093906Z_gen_g4_detsim_hitreco__20240229T181838Z_reco2_reco2.root"
03-Nov-2025 18:20:26 CET  Closed input file "root://xrootd.echo.stfc.ac.uk:1094/dune:/protodune/RSE/fardet-hd/98/fb/nu_dune10kt_1x2x6_1408_660_20230826T093906Z_gen_g4_detsim_hitreco__20240229T181838Z_reco2.root"

================================================================================================================================
TimeTracker printout (sec)                        Min           Avg           Max         Median          RMS         nEvts   
================================================================================================================================
Full event                                     0.561395       2.89377       6.32247       2.7162       0.702551        100    
--------------------------------------------------------------------------------------------------------------------------------
source:RootInput(read)                         0.0453962     0.204087       2.00603      0.177867      0.188976        100    
reco:pandora:StandardPandora                   0.368211       2.6848        6.0902        2.52581      0.672878        100    
[art]:TriggerResults:TriggerResultInserter     1.056e-05    1.83485e-05    4.548e-05    1.69655e-05   6.73669e-06      100    
end_path:out1:RootOutput                       2.61e-06     4.22119e-06   1.3841e-05     3.625e-06    1.6896e-06       100    
end_path:out1:RootOutput(write)               0.000944739    0.004668      0.0194833     0.0034999    0.00367087       100    
================================================================================================================================

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

  Peak virtual memory usage (VmPeak)  : 2299.11 MB
  Peak resident set size usage (VmHWM): 1299.16 MB
====================================================================================================
Art has completed and will exit with status 0.
=== End last 100 lines of lar log file ===
mv: cannot stat 'CheatingKalmanSplittingV.root': No such file or directory
mv: cannot stat 'CheatingKalmanSplittingW.root': No such file or directory
justIN time: 2025-11-05 07:14:59 UTC       justIN version: 01.05.01