loading system configuration loading override configuration from /home/nexmap/pkwi/McCode/tools/Python/mctest/../mccodelib/mcstas-test/McStas_CPU_MPICC_KISS/mccode_config.json INFO: Using directory: "1" INFO: Using existing c-file: ./ILL_IN6.c INFO: Using existing binary: ./ILL_IN6.out INFO: === Simulation 'ILL_IN6' (/home/nexmap/pkwi/TESTS/2022-11-01/McStas_CPU_MPICC_KISS_1e7/ILL_IN6/ILL_IN6.instr): running on 8 nodes (master is 'panda2.fysik.dtu.dk', MPI version 3.0). Instrument Simulation ILL_IN6 (/home/nexmap/pkwi/TESTS/2022-11-01/McStas_CPU_MPICC_KISS_1e7/ILL_IN6/ILL_IN6.instr) using computed monochromator take-off angles: 75.4011 76.1933 76.9908 [deg] Wavelength [AA] 4.14 Neutron velocity [m/s] 955.564 Monochr. Bragg angle [deg] 38.0966 Incident Energy [meV] 4.77282 Instrument Simulation ILL_IN6 (/home/nexmap/pkwi/TESTS/2022-11-01/McStas_CPU_MPICC_KISS_1e7/ILL_IN6/ILL_IN6.instr) using computed monochromator take-off angles: 75.4011 76.1933 76.9908 [deg] Wavelength [AA] 4.14 Neutron velocity [m/s] 955.564 Monochr. Bragg angle [deg] 38.0966 Incident Energy [meV] 4.77282 Focusing Energy transfer[meV] 0 Travel time: Supp./Fermi [us] 209.301 Travel time: Supp./Det. [us] 3294.39 Instrument Simulation ILL_IN6 (/home/nexmap/pkwi/TESTS/2022-11-01/McStas_CPU_MPICC_KISS_1e7/ILL_IN6/ILL_IN6.instr) using computed monochromator take-off angles: 75.4011 76.1933 76.9908 [deg] Wavelength [AA] 4.14 Neutron velocity [m/s] 955.564 Monochr. Bragg angle [deg] 38.0966 Incident Energy [meV] 4.77282 Focusing Energy transfer[meV] 0 Instrument Simulation ILL_IN6 (/home/nexmap/pkwi/TESTS/2022-11-01/McStas_CPU_MPICC_KISS_1e7/ILL_IN6/ILL_IN6.instr) using computed monochromator take-off angles: 75.4011 76.1933 76.9908 [deg] Wavelength [AA] 4.14 Neutron velocity [m/s] 955.564 Monochr. Bragg angle [deg] 38.0966 Incident Energy [meV] 4.77282 Focusing Energy transfer[meV] 0 Travel time: Supp./Fermi [us] 209.301 Travel time: Supp./Det. [us] 3294.39 TOF Delay [us] 282.75 TOF Dead Time [us] 2.37202 TOF Period (1 cycle) [us] 6034.37 TOF Channel width [us] 47.125 Instrument Simulation ILL_IN6 (/home/nexmap/pkwi/TESTS/2022-11-01/McStas_CPU_MPICC_KISS_1e7/ILL_IN6/ILL_IN6.instr) using computed monochromator take-off angles: 75.4011 76.1933 76.9908 [deg] Wavelength [AA] 4.14 Neutron velocity [m/s] 955.564 Monochr. Bragg angle [deg] 38.0966 Incident Energy [meV] 4.77282 Focusing Energy transfer[meV] 0 Travel time: Supp./Fermi [us] 209.301 Travel time: Supp./Det. [us] 3294.39 TOF Delay [us] 282.75 TOF Dead Time [us] 2.37202 TOF Period (1 cycle) [us] 6034.37 TOF Channel width [us] 47.125 CHOP Fermi Phase [deg] -6.24325 CHOP Suppressor Phase [deg] 0 CHOP Fermi Speed [rpm] 4971.52 CHOP Suppressor Speed [rpm] 4971.52 Number of time channels 128 Current Elastic Peak Ch. 64 Elast. peak ch. for 0-delay 70 Time window: min=0.56114 max=6.59314 delay=0.28275 tof-width=6.032 [ms] Instrument Simulation ILL_IN6 (/home/nexmap/pkwi/TESTS/2022-11-01/McStas_CPU_MPICC_KISS_1e7/ILL_IN6/ILL_IN6.instr) using computed monochromator take-off angles: 75.4011 76.1933 76.9908 [deg] Wavelength [AA] 4.14 Neutron velocity [m/s] 955.564 Monochr. Bragg angle [deg] 38.0966 Incident Energy [meV] 4.77282 Focusing Energy transfer[meV] 0 Travel time: Supp./Fermi [us] 209.301 Travel time: Supp./Det. [us] 3294.39 TOF Delay [us] 282.75 TOF Dead Time [us] 2.37202 TOF Period (1 cycle) [us] 6034.37 TOF Channel width [us] 47.125 CHOP Fermi Phase [deg] -6.24325 CHOP Suppressor Phase [deg] 0 CHOP Fermi Speed [rpm] 4971.52 CHOP Suppressor Speed [rpm] 4971.52 Number of time channels 128 Instrument Simulation ILL_IN6 (/home/nexmap/pkwi/TESTS/2022-11-01/McStas_CPU_MPICC_KISS_1e7/ILL_IN6/ILL_IN6.instr) using computed monochromator take-off angles: 75.4011 76.1933 76.9908 [deg] Wavelength [AA] 4.14 Neutron velocity [m/s] 955.564 Monochr. Bragg angle [deg] 38.0966 Incident Energy [meV] 4.77282 Focusing Energy transfer[meV] 0 Travel time: Supp./Fermi [us] 209.301 Travel time: Supp./Det. [us] 3294.39 TOF Delay [us] 282.75 TOF Dead Time [us] 2.37202 TOF Period (1 cycle) [us] 6034.37 TOF Channel width [us] 47.125 CHOP Fermi Phase [deg] -6.24325 CHOP Suppressor Phase [deg] 0 CHOP Fermi Speed [rpm] 4971.52 CHOP Suppressor Speed [rpm] 4971.52 Number of time channels 128 Current Elastic Peak Ch. 64 Elast. peak ch. for 0-delay 70 Current Elastic Peak Ch. 64 Elast. peak ch. for 0-delay 70 Time window: min=0.56114 max=6.59314 delay=0.28275 tof-width=6.032 [ms] Focusing Energy transfer[meV] 0 Travel time: Supp./Fermi [us] 209.301 Travel time: Supp./Det. [us] 3294.39 TOF Delay [us] 282.75 TOF Dead Time [us] 2.37202 TOF Period (1 cycle) [us] 6034.37 TOF Channel width [us] 47.125 CHOP Fermi Phase [deg] -6.24325 CHOP Suppressor Phase [deg] 0 CHOP Fermi Speed [rpm] 4971.52 CHOP Suppressor Speed [rpm] 4971.52 Number of time channels 128 Current Elastic Peak Ch. 64 Elast. peak ch. for 0-delay 70 Time window: min=0.56114 max=6.59314 delay=0.28275 tof-width=6.032 [ms] TOF Delay [us] 282.75 TOF Dead Time [us] 2.37202 TOF Period (1 cycle) [us] 6034.37 TOF Channel width [us] 47.125 CHOP Fermi Phase [deg] -6.24325 CHOP Suppressor Phase [deg] 0 CHOP Fermi Speed [rpm] 4971.52 CHOP Suppressor Speed [rpm] 4971.52 Number of time channels 128 Current Elastic Peak Ch. 64 Elast. peak ch. for 0-delay 70 Time window: min=0.56114 max=6.59314 delay=0.28275 tof-width=6.032 [ms] Travel time: Supp./Fermi [us] 209.301 Travel time: Supp./Det. [us] 3294.39 TOF Delay [us] 282.75 TOF Dead Time [us] 2.37202 TOF Period (1 cycle) [us] 6034.37 TOF Channel width [us] 47.125 CHOP Fermi Phase [deg] -6.24325 CHOP Suppressor Phase [deg] 0 CHOP Fermi Speed [rpm] 4971.52 CHOP Suppressor Speed [rpm] 4971.52 Number of time channels 128 Current Elastic Peak Ch. 64 Elast. peak ch. for 0-delay 70 Time window: min=0.56114 max=6.59314 delay=0.28275 tof-width=6.032 [ms] CHOP Fermi Phase [deg] -6.24325 CHOP Suppressor Phase [deg] 0 CHOP Fermi Speed [rpm] 4971.52 CHOP Suppressor Speed [rpm] 4971.52 Number of time channels 128 Current Elastic Peak Ch. 64 Elast. peak ch. for 0-delay 70 Time window: min=0.56114 max=6.59314 delay=0.28275 tof-width=6.032 [ms] Time window: min=0.56114 max=6.59314 delay=0.28275 tof-width=6.032 [ms] Instrument Simulation ILL_IN6 (/home/nexmap/pkwi/TESTS/2022-11-01/McStas_CPU_MPICC_KISS_1e7/ILL_IN6/ILL_IN6.instr) using computed monochromator take-off angles: 75.4011 76.1933 76.9908 [deg] Wavelength [AA] 4.14 Neutron velocity [m/s] 955.564 Monochr. Bragg angle [deg] 38.0966 Incident Energy [meV] 4.77282 Focusing Energy transfer[meV] 0 Travel time: Supp./Fermi [us] 209.301 Travel time: Supp./Det. [us] 3294.39 TOF Delay [us] 282.75 TOF Dead Time [us] 2.37202 TOF Period (1 cycle) [us] 6034.37 TOF Channel width [us] 47.125 CHOP Fermi Phase [deg] -6.24325 CHOP Suppressor Phase [deg] 0 CHOP Fermi Speed [rpm] 4971.52 CHOP Suppressor Speed [rpm] 4971.52 Number of time channels 128 Current Elastic Peak Ch. 64 Elast. peak ch. for 0-delay 70 Time window: min=0.56114 max=6.59314 delay=0.28275 tof-width=6.032 [ms] [ILL_IN6] Initialize [ILL_IN6] Initialize [ILL_IN6] Initialize [ILL_IN6] Initialize [ILL_IN6] Initialize [ILL_IN6] Initialize [ILL_IN6] Initialize [ILL_IN6] Initialize Source_gen: component VCS (square 0.03 x 0.2) focusing distance dist=2.55 area=0.03 x 0.2 spectra 4.065 to 4.215 AA (4.605 to 4.951 meV) T1=216.8 K (2.093 AA), T2=33.9 K (5.292 AA), T3=16.7 K (7.539 AA) Flux is dPhi/dlambda in [n/s/cm2]. Opening input file '/u/data/pkwi/McStas/mcstas/3.x-dev/tools/Python/mcrun/../mccodelib/../../../data/HOPG.rfl' (Table_Read_Offset) Opening input file '/u/data/pkwi/McStas/mcstas/3.x-dev/tools/Python/mcrun/../mccodelib/../../../data/HOPG.trm' (Table_Read_Offset) FermiChopper: Suppressor: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=0 [deg] FermiChopper: FermiM: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=-6.24325 [deg] FermiChopper: Suppressor: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=0 [deg] FermiChopper: FermiM: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=-6.24325 [deg] FermiChopper: Suppressor: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=0 [deg] FermiChopper: FermiM: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=-6.24325 [deg] Reusing input file 'HOPG.rfl' (Table_Read_Offset) FermiChopper: Suppressor: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=0 [deg] FermiChopper: FermiM: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=-6.24325 [deg] Reusing input file 'HOPG.trm' (Table_Read_Offset) Reusing input file 'HOPG.rfl' (Table_Read_Offset) FermiChopper: Suppressor: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=0 [deg] Reusing input file 'HOPG.trm' (Table_Read_Offset) FermiChopper: FermiM: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=-6.24325 [deg] FermiChopper: Suppressor: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=0 [deg] FermiChopper: FermiM: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=-6.24325 [deg] FermiChopper: Suppressor: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=0 [deg] FermiChopper: FermiM: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=-6.24325 [deg] FermiChopper: Suppressor: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=0 [deg] FermiChopper: FermiM: Frequency nu=82.8587 [Hz] 4971.52 [rpm], time frame=0.0241375 [s] phase=-6.24325 [deg] Isotropic_Sqw: Sample: is a hollow cylinder: radius=0.010000 thickness=0.005000 height=0.055000 [J Comp Phys 228 (2009) 5251] Opening input file '/u/data/pkwi/McStas/mcstas/3.x-dev/tools/Python/mcrun/../mccodelib/../../../data/Rb_liq_inc.sqw' (Table_Read_Offset) Opening input file '/u/data/pkwi/McStas/mcstas/3.x-dev/tools/Python/mcrun/../mccodelib/../../../data/Rb_liq_inc.sqw' (Table_Read_Offset) Opening input file '/u/data/pkwi/McStas/mcstas/3.x-dev/tools/Python/mcrun/../mccodelib/../../../data/Rb_liq_inc.sqw' (Table_Read_Offset) Opening input file '/u/data/pkwi/McStas/mcstas/3.x-dev/tools/Python/mcrun/../mccodelib/../../../data/Rb_liq_inc.sqw' (Table_Read_Offset) Isotropic_Sqw: Sample: Temperature set to T=350 [K] Isotropic_Sqw: Sample: S(q,w) data from Rb_liq_inc.sqw (inc) assumed to be classical (symmetrised in energy). Isotropic_Sqw: Sample: Applying exp(hw/2kT) factor with T=350 [K] on Rb_liq_inc.sqw file (classical/symmetric) using 'Frommhold' quantum correction Isotropic_Sqw: Sample: Generated Rb_liq_inc.sqw incoherent Sqw q=[0.1:10 Angs-1] w=[0:101.849 meV] |S|=0.985192 size=[101x10185] sigma=0.5 [barns] normalization factor S(q,w)*0.492586 (auto) \int q^2 S(q) dq=676.701 Opening input file '/u/data/pkwi/McStas/mcstas/3.x-dev/tools/Python/mcrun/../mccodelib/../../../data/Rb_liq_coh.sqw' (Table_Read_Offset) Opening input file '/u/data/pkwi/McStas/mcstas/3.x-dev/tools/Python/mcrun/../mccodelib/../../../data/Rb_liq_coh.sqw' (Table_Read_Offset) Opening input file '/u/data/pkwi/McStas/mcstas/3.x-dev/tools/Python/mcrun/../mccodelib/../../../data/Rb_liq_coh.sqw' (Table_Read_Offset) Opening input file '/u/data/pkwi/McStas/mcstas/3.x-dev/tools/Python/mcrun/../mccodelib/../../../data/Rb_liq_coh.sqw' (Table_Read_Offset) Isotropic_Sqw: Sample: Temperature set to T=350 [K] Isotropic_Sqw: Sample: S(q,w) data from Rb_liq_coh.sqw (coh) assumed to be classical (symmetrised in energy). Isotropic_Sqw: Sample: Applying exp(hw/2kT) factor with T=350 [K] on Rb_liq_coh.sqw file (classical/symmetric) using 'Frommhold' quantum correction Isotropic_Sqw: Sample: Generated Rb_liq_coh.sqw coherent Sqw q=[0.1:10 Angs-1] w=[0:101.849 meV] |S|=0.887933 size=[101x10185] sigma=6.32 [barns] normalization factor S(q,w)*0.477012 (auto) \int q^2 S(q) dq=698.369 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.672376 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.628786 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.65348 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.648886 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.633013 in slit does not match its length=0.012 (slit exit expected). Trace ETA 3.26667 [min] % 5 Trace ETA 3.36667 [min] % 5 Trace ETA 2.9 [min] % 6 Trace ETA 3.05 [min] % 6 Trace ETA 3.88333 [min] % 4 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.646647 in slit does not match its length=0.012 (slit exit expected). Trace ETA 2.96667 [min] % 6 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.643498 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.96649 in slit does not match its length=0.012 (slit exit expected). Trace ETA 3.31667 [min] % 5 Trace ETA 3.31667 [min] % 5 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.961699 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.950908 in slit does not match its length=0.012 (slit exit expected). 10 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.6639 in slit does not match its length=0.012 (slit exit expected). 10 10 10 10 10 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.652947 in slit does not match its length=0.012 (slit exit expected). 10 10 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.971742 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.66439 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.694046 in slit does not match its length=0.012 (slit exit expected). 20 20 20 20 20 20 20 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.648148 in slit does not match its length=0.012 (slit exit expected). 20 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.641052 in slit does not match its length=0.012 (slit exit expected). 30 30 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.944199 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.972552 in slit does not match its length=0.012 (slit exit expected). 30 30 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.655501 in slit does not match its length=0.012 (slit exit expected). 30 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.976167 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.974481 in slit does not match its length=0.012 (slit exit expected). 30 30 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.970844 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.666654 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.674254 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.974629 in slit does not match its length=0.012 (slit exit expected). 40 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.950374 in slit does not match its length=0.012 (slit exit expected). 40 30 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.95811 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.65462 in slit does not match its length=0.012 (slit exit expected). 40 40 40 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.682192 in slit does not match its length=0.012 (slit exit expected). 40 40 50 50 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.965524 in slit does not match its length=0.012 (slit exit expected). 40 50 50 50 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.950352 in slit does not match its length=0.012 (slit exit expected). 50 50 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.9767 in slit does not match its length=0.012 (slit exit expected). 60 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.649072 in slit does not match its length=0.012 (slit exit expected). 60 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.646559 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.953296 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.925637 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.966623 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.946267 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.680719 in slit does not match its length=0.012 (slit exit expected). 60 60 60 50 70 60 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.663355 in slit does not match its length=0.012 (slit exit expected). 60 70 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.674225 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.651136 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.945892 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.657376 in slit does not match its length=0.012 (slit exit expected). 70 70 70 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.974466 in slit does not match its length=0.012 (slit exit expected). 80 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.965614 in slit does not match its length=0.012 (slit exit expected). 70 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.646993 in slit does not match its length=0.012 (slit exit expected). 70 80 60 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.974604 in slit does not match its length=0.012 (slit exit expected). 90 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.630926 in slit does not match its length=0.012 (slit exit expected). 80 80 80 90 80 80 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.951273 in slit does not match its length=0.012 (slit exit expected). 70 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.652159 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.676515 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.979182 in slit does not match its length=0.012 (slit exit expected). 90 90 90 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.665522 in slit does not match its length=0.012 (slit exit expected). 90 90 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.97844 in slit does not match its length=0.012 (slit exit expected). 80 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.972795 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.63698 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.977417 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.628732 in slit does not match its length=0.012 (slit exit expected). *** TRACE end *** 90 FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.671884 in slit does not match its length=0.012 (slit exit expected). FermiChopper: Suppressor: ABSORB Neutron propagation time v*dt/length=0.95516 in slit does not match its length=0.012 (slit exit expected). Save [ILL_IN6] Detector: Mon_SuppInL_I=7.28885e+09 Mon_SuppInL_ERR=1.41298e+06 Mon_SuppInL_N=2.66952e+07 "Mon_SuppInL_1667259394.L" Detector: Mon_SuppInT_I=7.67894e+09 Mon_SuppInT_ERR=1.45291e+06 Mon_SuppInT_N=2.80247e+07 "Mon_SuppInT_1667259394.t" FermiChopper: Suppressor Mean velocity v = 954.902 [m/s] Mean wavelength lambda= 4.14287 [Angs] Mean energy omega = 4.76621 [meV] Mean arrival time t = 0.00228313 [s] Mean phase = 70.2905 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 154.011 [deg] (full width) Opening time dt = 0.295824 [s] Intensity reaching FC = 4.53514e+08 [n/s] FermiChopper: Suppressor Mean velocity v = 954.9 [m/s] Mean wavelength lambda= 4.14288 [Angs] Mean energy omega = 4.76619 [meV] Mean arrival time t = 0.0022841 [s] Mean phase = 70.3193 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 154.011 [deg] (full width) Opening time dt = 0.295824 [s] Intensity reaching FC = 4.54786e+08 [n/s] FermiChopper: Suppressor Mean velocity v = 954.887 [m/s] Mean wavelength lambda= 4.14294 [Angs] Mean energy omega = 4.76606 [meV] Mean arrival time t = 0.00228132 [s] Mean phase = 70.2363 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 154.011 [deg] (full width) Opening time dt = 0.295824 [s] Intensity reaching FC = 4.53442e+08 [n/s] Intensity passing FC = 1.21329e+08 [n/s] FermiChopper: Suppressor: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 191206 At cylinder entrance: 1188777 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 36167 FermiChopper: Suppressor Mean velocity v = 954.871 [m/s] Mean wavelength lambda= 4.143 [Angs] Mean energy omega = 4.7659 [meV] Mean arrival time t = 0.00228212 [s] Mean phase = 70.2603 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 154.011 [deg] (full width) Opening time dt = 0.295824 [s] Intensity reaching FC = 4.5428e+08 [n/s] Intensity passing FC = 1.2155e+08 [n/s] FermiChopper: Suppressor: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 191443 At cylinder entrance: 1188201 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 36756 At slit pack entrance: 302015 On absorbing slit coating: 234834 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 7 At cylinder exit: 579645 FermiChopper: Suppressor Mean velocity v = 954.901 [m/s] Mean wavelength lambda= 4.14287 [Angs] Mean energy omega = 4.7662 [meV] Mean arrival time t = 0.00228193 [s] Mean phase = 70.2547 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 154.011 [deg] (full width) Opening time dt = 0.295824 [s] Intensity reaching FC = 4.54252e+08 [n/s] Intensity passing FC = 1.21523e+08 [n/s] FermiChopper: Suppressor: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 190720 At cylinder entrance: 1193276 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 36399 At slit pack entrance: 299282 On absorbing slit coating: 234331 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 6 FermiChopper: Suppressor Mean velocity v = 954.884 [m/s] Mean wavelength lambda= 4.14295 [Angs] Mean energy omega = 4.76603 [meV] Mean arrival time t = 0.00228068 [s] Mean phase = 70.2175 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 154.011 [deg] (full width) Opening time dt = 0.295824 [s] Intensity reaching FC = 4.53492e+08 [n/s] Intensity passing FC = 1.21426e+08 [n/s] FermiChopper: Suppressor: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 190832 At cylinder entrance: 1188875 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 36178 At slit pack entrance: 301074 On absorbing slit coating: 233351 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 5 At cylinder exit: 578201 Warning: Can not reach slit wall: 0 Warning: Can not reach slit output: 27 FermiChopper: Suppressor Mean velocity v = 954.883 [m/s] Mean wavelength lambda= 4.14295 [Angs] Mean energy omega = 4.76602 [meV] Mean arrival time t = 0.00228586 [s] Mean phase = 70.372 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 154.011 [deg] (full width) Opening time dt = 0.295824 [s] Intensity reaching FC = 4.53928e+08 [n/s] Intensity passing FC = 1.21273e+08 [n/s] FermiChopper: Suppressor: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 191896 At cylinder entrance: 1189609 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 35897 At slit pack entrance: 301265 On absorbing slit coating: 234519 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 7 At cylinder exit: 576239 Warning: Can not reach slit wall: 0 Warning: Can not reach slit output: 22 Intensity passing FC = 1.21361e+08 [n/s] FermiChopper: Suppressor: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 191624 At cylinder entrance: 1189168 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 35907 At slit pack entrance: 299332 On absorbing slit coating: 233904 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 6 At cylinder exit: 577480 Warning: Can not reach slit wall: 0 Warning: Can not reach slit output: 23 Intensity passing FC = 1.21593e+08 [n/s] FermiChopper: Suppressor: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 191297 At cylinder entrance: 1192850 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 36095 At slit pack entrance: 300674 On absorbing slit coating: 235889 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 8 At cylinder exit: 577369 Warning: Can not reach slit wall: 0 Warning: Can not reach slit output: 22 At slit pack entrance: 300536 On absorbing slit coating: 233971 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 10 At cylinder exit: 578539 Warning: Can not reach slit wall: 0 Warning: Can not reach slit output: 26 Warning: Can not reach slit wall: 0 Warning: Can not reach slit output: 14 At cylinder exit: 578514 Warning: Can not reach slit wall: 0 Warning: Can not reach slit output: 24 FermiChopper: Suppressor Mean velocity v = 954.887 [m/s] Mean wavelength lambda= 4.14293 [Angs] Mean energy omega = 4.76606 [meV] Mean arrival time t = 0.00228318 [s] Mean phase = 70.2919 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 154.011 [deg] (full width) Opening time dt = 0.295824 [s] Intensity reaching FC = 4.54012e+08 [n/s] Intensity passing FC = 1.21281e+08 [n/s] FermiChopper: Suppressor: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 190764 At cylinder entrance: 1192200 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 36077 At slit pack entrance: 299825 On absorbing slit coating: 235155 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 12 At cylinder exit: 578906 Warning: Can not reach slit wall: 0 Warning: Can not reach slit output: 30 Detector: Mon_SuppOutT_I=9.63928e+08 Mon_SuppOutT_ERR=245183 Mon_SuppOutT_N=1.55089e+07 "Mon_SuppOutT_1667259394.t" FermiChopper: FermiM Mean velocity v = 957.099 [m/s] Mean wavelength lambda= 4.13336 [Angs] Mean energy omega = 4.78817 [meV] Mean arrival time t = 0.000161022 [s] Mean phase = 6.04979 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 2.10061 [deg] (full width) Opening time dt = 0.00403485 [s] Intensity reaching FC = 7.96889e+07 [n/s] Intensity passing FC = 3.24122e+06 [n/s] FermiChopper: FermiM: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 32373 At cylinder entrance: 29475 Hit cyl. entrance sides: 0 FermiChopper: FermiM Mean velocity v = 957.063 [m/s] Mean wavelength lambda= 4.13351 [Angs] Mean energy omega = 4.78781 [meV] Mean arrival time t = 0.000160577 [s] Mean phase = 6.03655 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 2.10061 [deg] (full width) Opening time dt = 0.00403485 [s] Intensity reaching FC = 7.94873e+07 [n/s] Intensity passing FC = 3.2374e+06 [n/s] FermiChopper: FermiM: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 32495 At cylinder entrance: 29106 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 2 At slit pack entrance: 1403 On absorbing slit coating: 1195979 Exiting slit pack: 0 FermiChopper: FermiM Mean velocity v = 957.087 [m/s] Mean wavelength lambda= 4.13341 [Angs] Mean energy omega = 4.78805 [meV] Mean arrival time t = 0.000161183 [s] Mean phase = 6.0546 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 2.10061 [deg] (full width) Opening time dt = 0.00403485 [s] Intensity reaching FC = 7.95728e+07 [n/s] Intensity passing FC = 3.24974e+06 [n/s] FermiChopper: FermiM: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 32296 At cylinder entrance: 29524 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 3 At slit pack entrance: 1435 On absorbing slit coating: 1196375 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 0 At cylinder exit: 97 FermiChopper: FermiM Mean velocity v = 957.081 [m/s] Mean wavelength lambda= 4.13344 [Angs] Mean energy omega = 4.78798 [meV] Mean arrival time t = 0.000160893 [s] Mean phase = 6.04597 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 2.10061 [deg] (full width) Opening time dt = 0.00403485 [s] Intensity reaching FC = 7.97344e+07 [n/s] Intensity passing FC = 3.21076e+06 [n/s] FermiChopper: FermiM: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 32325 At cylinder entrance: 29634 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 2 At slit pack entrance: 1437 On absorbing slit coating: 1199476 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 0 At cylinder exit: 97 FermiChopper: FermiM Mean velocity v = 957.054 [m/s] Mean wavelength lambda= 4.13355 [Angs] Mean energy omega = 4.78772 [meV] Mean arrival time t = 0.000160954 [s] Mean phase = 6.04783 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 2.10061 [deg] (full width) Opening time dt = 0.00403485 [s] Intensity reaching FC = 7.95406e+07 [n/s] Intensity passing FC = 3.2368e+06 [n/s] FermiChopper: FermiM: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 32458 At cylinder entrance: 29481 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 1 At slit pack entrance: 1520 On absorbing slit coating: 1196340 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 0 At cylinder exit: 93 Warning: Can not reach slit wall: 0 Warning: Can not reach slit output: 1 FermiChopper: FermiM Mean velocity v = 957.077 [m/s] Mean wavelength lambda= 4.13345 [Angs] Mean energy omega = 4.78795 [meV] Mean arrival time t = 0.000160525 [s] Mean phase = 6.035 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 2.10061 [deg] (full width) Opening time dt = 0.00403485 [s] Intensity reaching FC = 7.96315e+07 [n/s] Intensity passing FC = 3.22233e+06 [n/s] FermiChopper: FermiM: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 32509 At cylinder entrance: 29644 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 3 At slit pack entrance: 1393 On absorbing slit coating: 1197844 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 0 At cylinder exit: 104 Warning: Can not reach slit wall: 0 Warning: Can not reach slit output: 1 FermiChopper: FermiM Mean velocity v = 957.065 [m/s] Mean wavelength lambda= 4.13351 [Angs] Mean energy omega = 4.78783 [meV] Mean arrival time t = 0.000161061 [s] Mean phase = 6.051 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 2.10061 [deg] (full width) Opening time dt = 0.00403485 [s] Intensity reaching FC = 7.96191e+07 [n/s] Intensity passing FC = 3.21446e+06 [n/s] FermiChopper: FermiM: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 32844 At cylinder entrance: 29659 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 6 At slit pack entrance: 1425 On absorbing slit coating: 1197754 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 0 At cylinder exit: 108 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 0 At cylinder exit: 98 Can't prop. to slit pack: 3 At slit pack entrance: 1409 On absorbing slit coating: 1198417 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 0 At cylinder exit: 103 FermiChopper: FermiM Mean velocity v = 957.069 [m/s] Mean wavelength lambda= 4.13349 [Angs] Mean energy omega = 4.78787 [meV] Mean arrival time t = 0.000161047 [s] Mean phase = 6.05057 [deg] (use phase=-(this value) to optimize) Slit pack divergence = 2.10061 [deg] (full width) Opening time dt = 0.00403485 [s] Intensity reaching FC = 7.95604e+07 [n/s] Intensity passing FC = 3.22604e+06 [n/s] FermiChopper: FermiM: Lost events anaylsis Already inside: 0 By Top/Bottom of cylinder: 32206 At cylinder entrance: 29535 Hit cyl. entrance sides: 0 Can't prop. to slit pack: 1 At slit pack entrance: 1334 On absorbing slit coating: 1196812 Exiting slit pack: 0 Too many iterations: 0 Prop. in wrong direction : 0 Mad neutron (no control): 0 At cylinder exit: 101 Warning: Can not reach slit wall: 0 Warning: Can not reach slit output: 1 Detector: Mon_FermiOutdT_I=2.53966e+07 Mon_FermiOutdT_ERR=39779.1 Mon_FermiOutdT_N=408994 "Mon_FermiOutdT_1667259394.t" Detector: MonokMonitor_I=66993.9 MonokMonitor_ERR=102.142 MonokMonitor_N=431661 "MonokMonitor_1667259394.U1_L" Detector: Mon_SampleInT_I=833445 Mon_SampleInT_ERR=1441.05 Mon_SampleInT_N=335642 "Mon_SampleInT_1667259394.t" Detector: Mon_SampleInXY_I=446626 Mon_SampleInXY_ERR=680.945 Mon_SampleInXY_N=431661 "Mon_SampleInXY_1667259394.x_y" Detector: Out_I=707159 Out_ERR=665.244 Out_N=1.37141e+06 "out.dat" Detector: M_theta_t_all_I=121742 M_theta_t_all_ERR=276.803 M_theta_t_all_N=236447 "M_theta_t_all_1667259415.A_E" Finally [ILL_IN6: 1]. Time: 3.75 [min] Finally [ILL_IN6: 1]. Time: 3.75 [min] Finally [ILL_IN6: 1]. Time: 3.76667 [min] Detector: Detector_nM_I=229846 Detector_nM_ERR=380.147 Detector_nM_N=446832 "Detector_nM.dat" Finally [ILL_IN6: 1]. Time: 3.73333 [min] Finally [ILL_IN6: 1]. Time: 3.76667 [min] Finally [ILL_IN6: 1]. Time: 3.7 [min] Finally [ILL_IN6: 1]. Time: 3.76667 [min] Finally [ILL_IN6: 1]. Time: 3.71667 [min] Isotropic_Sqw: Sample: 5220230 neutron events (out of 6864390) that should have scattered were transmitted because scattering conditions WARNING could not be satisfied after 100 tries. Isotropic_Sqw: Sample: 5149 neutron events (out of 1644160) reached WARNING unrealistic weight. The S(q,w) norm might be too high. Isotropic_Sqw: Sample: Scattering fraction=0.0752575 of incoming intensity Absorption fraction =0.123054 Single scattering intensity =671421 (coh=617299 inc=54122.2) Multiple scattering intensity =35738.5 INFO: Placing instr file copy /home/nexmap/pkwi/TESTS/2022-11-01/McStas_CPU_MPICC_KISS_1e7/ILL_IN6/ILL_IN6.instr in dataset 1