Jobsub ID 297488.30@dunegpschedd02.fnal.gov

Jobsub ID	297488.30@dunegpschedd02.fnal.gov
Workflow ID	12654
Stage ID	4
User name	usher@fnal.gov
Requested	Processors	1
	GPU	No
	RSS bytes	4194304000 (4000 MiB)
	Wall seconds limit	28800 (8 hours)
Submitted time	2026-02-02 22:40:13
Site	NL_NIKHEF
Entry	VIRGO_NL_NIKHEF_dissel
Last heartbeat	2026-02-02 22:46:21
From worker node	Hostname	wn-sate-034.farm.nikhef.nl
	cpuinfo	AMD EPYC 7551P 32-Core Processor
	OS release	Scientific Linux release 7.9 (Nitrogen)
	Processors	1
	RSS bytes	4194304000 (4000 MiB)
	Wall seconds limit	129600 (36 hours)
	GPU
	Inner Apptainer?	True
Job state	jobscript_error
Started	2026-02-02 22:42:20
Input files	usertests:prodgenie_monte-carlo-012654-000744_gen_g4_detsim.root
Jobscript	Exit code	1
	Real time	0m (0s)
	CPU time	0m (0s = 0%)
	Max RSS bytes	0 (0 MiB)
Outputting started
Output files
Finished	2026-02-02 22:46:21
Saved logs	justin-logs:297488.30-dunegpschedd02.fnal.gov.logs.tgz
List job events Cached HTCondor job logs
Jobscript log (last 10,000 characters)

event: 20 at 02-Feb-2026 23:45:53 CET
++++>>>> total num hits: 133005, num free: 133005

Running Ophitfinder with InputDigiType = 'recob'
Found hits: 2852!
bad particle: track id = 0 PDG = 14 StatusCode = 0
bad particle: track id = 1 PDG = 1000180400 StatusCode = 0
bad particle: track id = 2 PDG = 2212 StatusCode = 11
bad particle: track id = 3 PDG = 1000170390 StatusCode = 2
bad particle: track id = 6 PDG = 2224 StatusCode = 3
bad particle: track id = 7 PDG = 2212 StatusCode = 14
bad particle: track id = 8 PDG = 211 StatusCode = 14
bad particle: track id = 12 PDG = 2000000002 StatusCode = 15
Filling voxel information...
   [93m[WARNING][00m [0m [94m<SuperaMCParticleCluster::AnalyzeSimChannel>[00m Total IDE ctr 96636
 ... due to missing track ID 0 from 0 track IDs
 ... due to invalid particle 213
 ... due to invalid 2d index 0
 ... due to invalid 3d index 14431

    [95m[NORMAL][00m [0m [94m<SuperaMCParticleCluster::process>[00m Saved interaction count: 1
    [95m[NORMAL][00m [0m [94m<SuperaMCParticleCluster::process>[00m 0 particles have no ancestor, summed deposit energy = 0
  [5;1;33;41m[CRITICAL][00m [0m [94m<SuperaMCParticleCluster::process>[00m SuperaMCParticleCluster.cxx::L2402 Particle index 11 holds particle w/ an invalid parent ID 65535
      [95mParticle  (PdgCode,TrackID) = (22,1)[00m ... with Parent (0,1)
      Vertex   (x, y, z, t) = (231.3,116.68,618.385,0)
      Momentum (px, py, pz) = (2.44822,4.70343,-1.69639)
      Final Momentum (end_px, end_py, end_pz) = (1.79769e+308,1.79769e+308,1.79769e+308)
      Initial Energy  = 5.56721
      Deposit  Energy  = 0
      Creation Process = primary
      Instance ID = 11
      Group ID    = 11
      Interaction ID = 0

      [95mParticle  (PdgCode,TrackID) = (22,1)[00m ... with Parent (0,1)
      Vertex   (x, y, z, t) = (231.3,116.68,618.385,0)
      Momentum (px, py, pz) = (2.44822,4.70343,-1.69639)
      Final Momentum (end_px, end_py, end_pz) = (1.79769e+308,1.79769e+308,1.79769e+308)
      Initial Energy  = 5.56721
      Deposit  Energy  = 0
      Creation Process = primary
      Instance ID = 11
      Group ID    = 11
      Interaction ID = 0

    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing particle_mpv_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing neutrino_mpv_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing cluster3d_mcst_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing cluster3d_pcluster_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing cluster3d_sed_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing cluster3d_masked_true2reco_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_pcluster_index_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_masked_true_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing cluster3d_pcluster_highE_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing cluster3d_pcluster_lowE_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_pcluster_leftover_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_pcluster_semantics_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing particle_pcluster_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing cluster3d_sed_at_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_chi2_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_occupancy_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_nhits_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_cryo_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_tpc_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_hit_charge0_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_hit_charge1_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_hit_charge2_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_hit_time0_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_hit_time1_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_hit_time2_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_hit_key0_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_hit_key1_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_hit_key2_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_pcluster_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_sed_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_pcluster_semantics_ghost_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing particle_corrected_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Writing sparse3d_reco_rescaled_tree with 19 entries
    [95m[NORMAL][00m [0m [94m<IOManager::finalize>[00m Closing output file
02-Feb-2026 23:46:02 CET  Closed input file "root://mover.pp.rl.ac.uk:1094/pnfs/pp.rl.ac.uk/data/dune/usertests/b9/e0/prodgenie_monte-carlo-012654-000744_gen_g4_detsim.root"

================================================================================================================================
TimeTracker printout (sec)                        Min           Avg           Max         Median          RMS         nEvts   
================================================================================================================================
Full event                                    0.000481817     7.14119       60.3604       2.80546       12.871         20     
--------------------------------------------------------------------------------------------------------------------------------
source:RootInput(read)                        0.000429107   0.00207295     0.0101588    0.000783645   0.00328376       20     
reco:gaushit:GausHitFinder                     0.0433637     0.105641      0.211638      0.106794      0.0482974       20     
reco:cluster3d:Cluster3D                       0.0067941      2.68626       36.9349      0.238114       7.95826        20     
reco:opdec:Deconvolution                       0.107628      0.230503      0.352193      0.221936      0.0693069       20     
reco:ophitspe:OpHitFinderDeco                   0.10755      0.112272      0.125725      0.110707     0.00465198       20     
reco:opflash:OpFlashFinder                    0.000674449   0.00151554    0.00273279    0.00164933    0.000513224      20     
reco:opslicer:OpSlicer                         0.0307375     0.322507      0.654266      0.242935      0.200903        20     
reco:mcreco:MCReco                             0.0315196     0.241792      0.781569      0.190763       0.20073        20     
[art]:TriggerResults:TriggerResultInserter     1.556e-05    2.36921e-05   6.7547e-05    2.20765e-05   1.08151e-05      20     
end_path:superaMC:LArSoftSuperaDriver          0.154097        3.606        19.5806       1.76058       4.64237        19     
end_path:out1:RootOutput                       4.028e-06    5.68958e-06   1.0068e-05     4.769e-06    1.82624e-06      19     
end_path:out1:RootOutput(write)                0.0476727     0.335183       2.26397      0.167219      0.492042        19     
================================================================================================================================

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

  Peak virtual memory usage (VmPeak)  : 7435.98 MB
  Peak resident set size usage (VmHWM): 2163.89 MB
====================================================================================================
%MSG-s ArtException:  PostEndJob 02-Feb-2026 23:46:02 CET ModuleEndJob
---- EventProcessorFailure BEGIN
  EventProcessor: an exception occurred during current event processing
  ---- EventProcessorFailure BEGIN
    EndPathExecutor: an exception occurred during current event processing
    ---- ScheduleExecutionFailure BEGIN
      Path: ProcessingStopped.
      ---- StdException BEGIN
        An exception was thrown while processing module LArSoftSuperaDriver/superaMC run: 100744 subRun: 0 event: 20
        std::exception
      ---- StdException END
      Exception going through path end_path
    ---- ScheduleExecutionFailure END
  ---- EventProcessorFailure END
---- EventProcessorFailure END
---- FatalRootError BEGIN
  Fatal Root Error: TTree::SetEntries
  Tree branches have different numbers of entries, eg EventAuxiliary has 19 entries while sim::OpDetDivRecs_opdigi__detsim. has 50 entries.
  ROOT severity: 2000
---- FatalRootError END
%MSG
Art has completed and will exit with status 1.
'larcv.root' -> 'prodgenie_monte-carlo-012654-000744_gen_g4_detsim_reco_larcv.root'
ERROR: Output file prodgenie_monte-carlo-012654-000744_gen_g4_detsim_reco.root not produced!