Jobsub ID 232195.9@dunegpschedd02.fnal.gov
| Jobsub ID | 232195.9@dunegpschedd02.fnal.gov | |
| Workflow ID | 9278 | |
| Stage ID | 1 | |
| User name | imawby@fnal.gov | |
| HTCondor Group | group_dune | |
| Requested | Processors | 1 | 
| GPU | No | |
| RSS bytes | 1048576000 (1000 MiB) | |
| Wall seconds limit | 7200 (2 hours) | |
| Submitted time | 2025-10-22 22:16:58 | |
| Site | US_FNAL-T1 | |
| Entry | CMSHTPC_T1_US_FNAL_condce_opp1_whole | |
| Last heartbeat | 2025-10-22 22:44:12 | |
| From worker node | Hostname | dunegli-47316-0-cmswn4025.fnal.gov | 
| cpuinfo | AMD EPYC 7543 32-Core Processor | |
| OS release | Scientific Linux release 7.9 (Nitrogen) | |
| Processors | 1 | |
| RSS bytes | 1048576000 (1000 MiB) | |
| Wall seconds limit | 171000 (47 hours) | |
| GPU | ||
| Inner Apptainer? | True | |
| Job state | finished | |
| Started | 2025-10-22 22:27:38 | |
| Input files | fardet-hd:nu_dune10kt_1x2x6_1114_475_20230827T153329Z_gen_g4_detsim_hitreco__20240223T221643Z_reco2.root | |
| Jobscript | Exit code | 0 | 
| Real time | 16m (983s) | |
| CPU time | 10m (647s = 65%) | |
| Max RSS bytes | 1535922176 (1464 MiB) | |
| Outputting started | 2025-10-22 22:44:02 | |
| Output files | https://fndcadoor.fnal.gov:2880/dune/scratch/users/imawby/kalmanAlg_nu_0/fnal/09278/1/002/ClusterValidation_WithAlg_nu_dune10kt_1x2x6_1114_475_20230827T153329Z_gen_g4_detsim_hitreco__20240223T221643Z_reco2.root https://fndcadoor.fnal.gov:2880/dune/scratch/users/imawby/kalmanAlg_nu_0/fnal/09278/1/002/ClusterValidation_WithoutAlg_nu_dune10kt_1x2x6_1114_475_20230827T153329Z_gen_g4_detsim_hitreco__20240223T221643Z_reco2.root  | |
| Finished | 2025-10-22 22:44:12 | |
| Saved logs | justin-logs:232195.9-dunegpschedd02.fnal.gov.logs.tgz | |
| List job events Cached HTCondor job logs | ||
Jobscript log (last 10,000 characters)
gov/usr/dune/persistent/staging/fardet-hd/fc/d8/nu_dune10kt_1x2x6_1114_475_20230827T153329Z_gen_g4_detsim_hitreco__20240223T221643Z_reco2.root
lar exit code 0
=== Start last 100 lines of lar log file ===
PandoraContentApi::Cluster::Create(*this, parameters, pNewCluster) return STATUS_CODE_INVALID_PARAMETER
    in function: ThisDivideCaloHits
    in file:     /exp/dune/app/users/imawby/dunesw_splitting/srcs/larpandoracontent/larpandoradlcontent/LArTwoDReco/DLClusterSplittingAlgorithm.cc line#: 194
pCurrentCaloHitMetaData->Update(*pSelectedCaloHitMetaData) return STATUS_CODE_FAILURE
    in function: EndReclustering
    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/Managers/CaloHitManager.cc line#: 392
this->GetManager<CaloHit>()->EndReclustering(&algorithm, clusterListToSaveName) return STATUS_CODE_FAILURE
    in function: EndFragmentation
    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#: 792
PandoraContentApi::EndFragmentation(*this, clusterListToSaveName, clusterListToDeleteName) return STATUS_CODE_FAILURE
    in function: ThisDivideCaloHits
    in file:     /exp/dune/app/users/imawby/dunesw_splitting/srcs/larpandoracontent/larpandoradlcontent/LArTwoDReco/DLClusterSplittingAlgorithm.cc line#: 198
Begin processing the 35th record. run: 1114 subRun: 1 event: 47535 at 22-Oct-2025 22:39:15 UTC
Begin processing the 36th record. run: 1114 subRun: 1 event: 47536 at 22-Oct-2025 22:39:20 UTC
Begin processing the 37th record. run: 1114 subRun: 1 event: 47537 at 22-Oct-2025 22:39:25 UTC
Begin processing the 38th record. run: 1114 subRun: 1 event: 47538 at 22-Oct-2025 22:39:32 UTC
Begin processing the 39th record. run: 1114 subRun: 1 event: 47539 at 22-Oct-2025 22:39:38 UTC
Begin processing the 40th record. run: 1114 subRun: 1 event: 47540 at 22-Oct-2025 22:39:48 UTC
Begin processing the 41st record. run: 1114 subRun: 1 event: 47541 at 22-Oct-2025 22:39:54 UTC
Begin processing the 42nd record. run: 1114 subRun: 1 event: 47542 at 22-Oct-2025 22:40:01 UTC
Begin processing the 43rd record. run: 1114 subRun: 1 event: 47543 at 22-Oct-2025 22:40:06 UTC
Begin processing the 44th record. run: 1114 subRun: 1 event: 47544 at 22-Oct-2025 22:40:51 UTC
Begin processing the 45th record. run: 1114 subRun: 1 event: 47545 at 22-Oct-2025 22:40:57 UTC
Begin processing the 46th record. run: 1114 subRun: 1 event: 47546 at 22-Oct-2025 22:41:03 UTC
Begin processing the 47th record. run: 1114 subRun: 1 event: 47547 at 22-Oct-2025 22:41:08 UTC
Begin processing the 48th record. run: 1114 subRun: 1 event: 47548 at 22-Oct-2025 22:41:14 UTC
Begin processing the 49th record. run: 1114 subRun: 1 event: 47549 at 22-Oct-2025 22:41:19 UTC
Begin processing the 50th record. run: 1114 subRun: 1 event: 47550 at 22-Oct-2025 22:41:23 UTC
Begin processing the 51st record. run: 1114 subRun: 1 event: 47551 at 22-Oct-2025 22:41:28 UTC
Begin processing the 52nd record. run: 1114 subRun: 1 event: 47552 at 22-Oct-2025 22:41:34 UTC
Begin processing the 53rd record. run: 1114 subRun: 1 event: 47553 at 22-Oct-2025 22:41:39 UTC
Begin processing the 54th record. run: 1114 subRun: 1 event: 47554 at 22-Oct-2025 22:41:48 UTC
Begin processing the 55th record. run: 1114 subRun: 1 event: 47555 at 22-Oct-2025 22:41:52 UTC
Begin processing the 56th record. run: 1114 subRun: 1 event: 47556 at 22-Oct-2025 22:41:56 UTC
Begin processing the 57th record. run: 1114 subRun: 1 event: 47557 at 22-Oct-2025 22:42:00 UTC
Begin processing the 58th record. run: 1114 subRun: 1 event: 47558 at 22-Oct-2025 22:42:03 UTC
Begin processing the 59th record. run: 1114 subRun: 1 event: 47559 at 22-Oct-2025 22:42:07 UTC
Begin processing the 60th record. run: 1114 subRun: 1 event: 47560 at 22-Oct-2025 22:42:10 UTC
Begin processing the 61st record. run: 1114 subRun: 1 event: 47561 at 22-Oct-2025 22:42:13 UTC
Begin processing the 62nd record. run: 1114 subRun: 1 event: 47562 at 22-Oct-2025 22:42:17 UTC
Begin processing the 63rd record. run: 1114 subRun: 1 event: 47563 at 22-Oct-2025 22:42:20 UTC
Begin processing the 64th record. run: 1114 subRun: 1 event: 47564 at 22-Oct-2025 22:42:23 UTC
Begin processing the 65th record. run: 1114 subRun: 1 event: 47565 at 22-Oct-2025 22:42:27 UTC
Begin processing the 66th record. run: 1114 subRun: 1 event: 47566 at 22-Oct-2025 22:42:30 UTC
Begin processing the 67th record. run: 1114 subRun: 1 event: 47567 at 22-Oct-2025 22:42:33 UTC
Begin processing the 68th record. run: 1114 subRun: 1 event: 47568 at 22-Oct-2025 22:42:36 UTC
Begin processing the 69th record. run: 1114 subRun: 1 event: 47569 at 22-Oct-2025 22:42:38 UTC
Begin processing the 70th record. run: 1114 subRun: 1 event: 47570 at 22-Oct-2025 22:42:40 UTC
Begin processing the 71st record. run: 1114 subRun: 1 event: 47571 at 22-Oct-2025 22:42:44 UTC
Begin processing the 72nd record. run: 1114 subRun: 1 event: 47572 at 22-Oct-2025 22:42:46 UTC
Begin processing the 73rd record. run: 1114 subRun: 1 event: 47573 at 22-Oct-2025 22:42:49 UTC
Begin processing the 74th record. run: 1114 subRun: 1 event: 47574 at 22-Oct-2025 22:42:51 UTC
Begin processing the 75th record. run: 1114 subRun: 1 event: 47575 at 22-Oct-2025 22:42:53 UTC
Begin processing the 76th record. run: 1114 subRun: 1 event: 47576 at 22-Oct-2025 22:42:55 UTC
Begin processing the 77th record. run: 1114 subRun: 1 event: 47577 at 22-Oct-2025 22:42:59 UTC
Begin processing the 78th record. run: 1114 subRun: 1 event: 47578 at 22-Oct-2025 22:43:02 UTC
Begin processing the 79th record. run: 1114 subRun: 1 event: 47579 at 22-Oct-2025 22:43:07 UTC
Begin processing the 80th record. run: 1114 subRun: 1 event: 47580 at 22-Oct-2025 22:43:18 UTC
Begin processing the 81st record. run: 1114 subRun: 1 event: 47581 at 22-Oct-2025 22:43:20 UTC
Begin processing the 82nd record. run: 1114 subRun: 1 event: 47582 at 22-Oct-2025 22:43:21 UTC
Begin processing the 83rd record. run: 1114 subRun: 1 event: 47583 at 22-Oct-2025 22:43:23 UTC
Begin processing the 84th record. run: 1114 subRun: 1 event: 47584 at 22-Oct-2025 22:43:25 UTC
Begin processing the 85th record. run: 1114 subRun: 1 event: 47585 at 22-Oct-2025 22:43:27 UTC
Begin processing the 86th record. run: 1114 subRun: 1 event: 47586 at 22-Oct-2025 22:43:30 UTC
Begin processing the 87th record. run: 1114 subRun: 1 event: 47587 at 22-Oct-2025 22:43:31 UTC
Begin processing the 88th record. run: 1114 subRun: 1 event: 47588 at 22-Oct-2025 22:43:34 UTC
Begin processing the 89th record. run: 1114 subRun: 1 event: 47589 at 22-Oct-2025 22:43:35 UTC
Begin processing the 90th record. run: 1114 subRun: 1 event: 47590 at 22-Oct-2025 22:43:37 UTC
Begin processing the 91st record. run: 1114 subRun: 1 event: 47591 at 22-Oct-2025 22:43:38 UTC
Begin processing the 92nd record. run: 1114 subRun: 1 event: 47592 at 22-Oct-2025 22:43:40 UTC
Begin processing the 93rd record. run: 1114 subRun: 1 event: 47593 at 22-Oct-2025 22:43:43 UTC
Begin processing the 94th record. run: 1114 subRun: 1 event: 47594 at 22-Oct-2025 22:43:44 UTC
Begin processing the 95th record. run: 1114 subRun: 1 event: 47595 at 22-Oct-2025 22:43:49 UTC
Begin processing the 96th record. run: 1114 subRun: 1 event: 47596 at 22-Oct-2025 22:43:51 UTC
Begin processing the 97th record. run: 1114 subRun: 1 event: 47597 at 22-Oct-2025 22:43:52 UTC
Begin processing the 98th record. run: 1114 subRun: 1 event: 47598 at 22-Oct-2025 22:43:53 UTC
Begin processing the 99th record. run: 1114 subRun: 1 event: 47599 at 22-Oct-2025 22:43:55 UTC
Begin processing the 100th record. run: 1114 subRun: 1 event: 47600 at 22-Oct-2025 22:43:58 UTC
22-Oct-2025 22:44:01 UTC  Closed output file "nu_dune10kt_1x2x6_1114_475_20230827T153329Z_gen_g4_detsim_hitreco__20240223T221643Z_reco2_reco2.root"
22-Oct-2025 22:44:01 UTC  Closed input file "root://fndcadoor.fnal.gov:1094/pnfs/fnal.gov/usr/dune/persistent/staging/fardet-hd/fc/d8/nu_dune10kt_1x2x6_1114_475_20230827T153329Z_gen_g4_detsim_hitreco__20240223T221643Z_reco2.root"
================================================================================================================================
TimeTracker printout (sec)                        Min           Avg           Max         Median          RMS         nEvts   
================================================================================================================================
Full event                                      1.21933       6.13414       63.5111       4.29643       9.96979        100    
--------------------------------------------------------------------------------------------------------------------------------
source:RootInput(read)                         0.0100447     0.035176      0.171319      0.0318174     0.0217168       100    
reco:pandora:StandardPandora                    1.19105       6.09026       63.4371       4.26236       9.96435        100    
[art]:TriggerResults:TriggerResultInserter    1.1091e-05    4.41758e-05   0.000358206   3.89785e-05   3.97716e-05      100    
end_path:out1:RootOutput                       3.106e-06    9.52922e-06   3.5988e-05    8.0105e-06    6.00643e-06      100    
end_path:out1:RootOutput(write)               0.000720131   0.00822133     0.0508839    0.00456029    0.00915516       100    
================================================================================================================================
====================================================================================================
MemoryTracker summary (base-10 MB units used)
  Peak virtual memory usage (VmPeak)  : 2584.9 MB
  Peak resident set size usage (VmHWM): 1535.92 MB
====================================================================================================
Art has completed and will exit with status 0.
=== End last 100 lines of lar log file ===