Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr LargeTestSuite_NB_LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ScalableTestSuite 2.2.0-master/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ScalableTestSuite 2.2.0-master/package.mo): time 0.5544/0.5544, allocations: 120.7 MB / 141.1 MB, free: 12.22 MB / 126.2 MB
"
[Timeout remaining time 179]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.001802/0.001802, allocations: 117.7 kB / 176.8 MB, free: 8.406 MB / 158.2 MB
"
[Timeout remaining time 180]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo): time 0.001321/0.001321, allocations: 198.4 kB / 212.6 MB, free: 12.28 MB / 174.5 MB
"
[Timeout remaining time 180]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo): time 0.5106/0.5106, allocations: 228.4 MB / 476.7 MB, free: 5.594 MB / 334.5 MB
"
[Timeout remaining time 179]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/LargeTestSuite 2.2.0-master/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/LargeTestSuite 2.2.0-master/package.mo): time 0.006369/0.006369, allocations: 1.584 MB / 0.5527 GB, free: 2.078 MB / 382.5 MB
"
[Timeout remaining time 180]
Using package LargeTestSuite with version 2.2.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/LargeTestSuite 2.2.0-master/package.mo)
Using package Modelica with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo)
Using package Complex with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo)
Using package ModelicaServices with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo)
Using package ScalableTestSuite with version 2.2.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ScalableTestSuite 2.2.0-master/package.mo)
Running command: translateModel(LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600,tolerance=0.0001,outputFormat="empty",numberOfIntervals=2500,variableFilter="",fileNamePrefix="LargeTestSuite_NB_LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600")
translateModel(LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600,tolerance=0.0001,outputFormat="empty",numberOfIntervals=2500,variableFilter="",fileNamePrefix="LargeTestSuite_NB_LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600") [Timeout 400]
"Notification: Performance of FrontEnd - Absyn->SCode: time 1.419e-05/1.419e-05, allocations: 2.281 kB / 0.7381 GB, free: 78.69 MB / 0.4985 GB
Notification: Performance of NFInst.instantiate(LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600): time 0.001433/0.001447, allocations: 1.259 MB / 0.7393 GB, free: 77.7 MB / 0.4985 GB
Notification: Performance of NFInst.instExpressions: time 0.0001254/0.001572, allocations: 29.45 kB / 0.7393 GB, free: 77.68 MB / 0.4985 GB
Notification: Performance of NFInst.updateImplicitVariability: time 2.235e-05/0.001595, allocations: 0 / 0.7393 GB, free: 77.68 MB / 0.4985 GB
Notification: Performance of NFTyping.typeComponents: time 5.737e-05/0.001652, allocations: 9.016 kB / 0.7393 GB, free: 77.67 MB / 0.4985 GB
Notification: Performance of NFTyping.typeBindings: time 4.102e-05/0.001693, allocations: 5.047 kB / 0.7393 GB, free: 77.66 MB / 0.4985 GB
Notification: Performance of NFTyping.typeClassSections: time 0.0001138/0.001807, allocations: 15.97 kB / 0.7394 GB, free: 77.65 MB / 0.4985 GB
Notification: Performance of NFFlatten.flatten: time 8.183e-05/0.001889, allocations: 53.05 kB / 0.7394 GB, free: 77.62 MB / 0.4985 GB
Notification: Performance of NFFlatten.resolveArrayConnections: time 3.744e-05/0.001926, allocations: 9.328 kB / 0.7394 GB, free: 77.61 MB / 0.4985 GB
Notification: Performance of NFEvalConstants.evaluate: time 4.672e-05/0.001973, allocations: 29.95 kB / 0.7394 GB, free: 77.6 MB / 0.4985 GB
Notification: Performance of NFSimplifyModel.simplify: time 4.23e-05/0.002015, allocations: 17.25 kB / 0.7395 GB, free: 77.59 MB / 0.4985 GB
Notification: Performance of NFPackage.collectConstants: time 1.36e-05/0.002029, allocations: 2.156 kB / 0.7395 GB, free: 77.59 MB / 0.4985 GB
Notification: Performance of NFFlatten.collectFunctions: time 9.468e-06/0.002038, allocations: 2.094 kB / 0.7395 GB, free: 77.59 MB / 0.4985 GB
Notification: Performance of combineBinaries: time 5.436e-05/0.002093, allocations: 58.08 kB / 0.7395 GB, free: 77.55 MB / 0.4985 GB
Notification: Performance of replaceArrayConstructors: time 1.161e-05/0.002104, allocations: 22.39 kB / 0.7395 GB, free: 77.54 MB / 0.4985 GB
Notification: Performance of NFVerifyModel.verify: time 1.486e-05/0.002119, allocations: 2.25 kB / 0.7395 GB, free: 77.54 MB / 0.4985 GB
Notification: Performance of FrontEnd: time 5.791e-06/0.002125, allocations: 4 kB / 0.7396 GB, free: 77.53 MB / 0.4985 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 819200 (4)
 * Number of variables: 819200 (2)
Notification: Performance of Bindings: time 0.0002911/0.002416, allocations: 322 kB / 0.7399 GB, free: 77.17 MB / 0.4985 GB
Notification: Performance of FunctionAlias: time 3.036e-05/0.002446, allocations: 30.45 kB / 0.7399 GB, free: 77.14 MB / 0.4985 GB
Notification: Performance of Early Inline: time 9.316e-05/0.002539, allocations: 157.7 kB / 0.74 GB, free: 77.02 MB / 0.4985 GB
Notification: Performance of Simplify 1: time 4.844e-05/0.002588, allocations: 76.19 kB / 0.7401 GB, free: 76.93 MB / 0.4985 GB
Notification: Performance of Alias: time 3.343e-05/0.002621, allocations: 73.25 kB / 0.7402 GB, free: 76.82 MB / 0.4985 GB
Notification: Performance of Simplify 2: time 3.561e-05/0.002657, allocations: 60.52 kB / 0.7402 GB, free: 76.75 MB / 0.4985 GB
Notification: Performance of Remove Stream: time 2.664e-05/0.002684, allocations: 62.42 kB / 0.7403 GB, free: 76.67 MB / 0.4985 GB
Notification: Performance of Detect States: time 0.0001787/0.002862, allocations: 112.2 kB / 0.7404 GB, free: 76.52 MB / 0.4985 GB
Notification: Performance of Events: time 1.401e-05/0.002876, allocations: 22.03 kB / 0.7404 GB, free: 76.5 MB / 0.4985 GB
Notification: Performance of Partitioning: time 5.032e-05/0.002927, allocations: 41.44 kB / 0.7405 GB, free: 76.46 MB / 0.4985 GB
Notification: Performance of Causalize: time 7.208/7.211, allocations: 3.825 GB / 4.566 GB, free: 343.2 MB / 1.25 GB
Notification: Performance of After Index Reduction Inline: time 0.0001445/7.211, allocations: 116.8 kB / 4.566 GB, free: 343.2 MB / 1.25 GB
Notification: Performance of Simplify: time 0.0001263/7.211, allocations: 114.1 kB / 4.566 GB, free: 343 MB / 1.25 GB
Notification: Performance of Inline: time 0.0001312/7.211, allocations: 187.2 kB / 4.566 GB, free: 342.9 MB / 1.25 GB
Notification: Performance of Partitioning: time 8.977e-06/7.211, allocations: 9.938 kB / 4.566 GB, free: 342.9 MB / 1.25 GB
Notification: Performance of Cleanup: time 2.388e-05/7.211, allocations: 29.67 kB / 4.566 GB, free: 342.9 MB / 1.25 GB
Notification: Performance of Causalize: time 19.14/26.35, allocations: 10.08 GB / 14.64 GB, free: 145.7 MB / 2.485 GB
Notification: Performance of Tearing: time 1.529e-05/26.35, allocations: 2 kB / 14.64 GB, free: 145.7 MB / 2.485 GB
Notification: Performance of Initialization: time 1.443e-06/26.35, allocations: 1.312 kB / 14.64 GB, free: 145.7 MB / 2.485 GB
Notification: Performance of Remove Dummies: time 5.1e-06/26.35, allocations: 9.391 kB / 14.64 GB, free: 145.7 MB / 2.485 GB
Notification: Performance of Tearing: time 9.82e-07/26.35, allocations: 0 / 14.64 GB, free: 145.7 MB / 2.485 GB
Notification: Performance of Categorize: time 1.019e-05/26.35, allocations: 1 kB / 14.64 GB, free: 145.7 MB / 2.485 GB
Notification: Performance of Solve: time 0.007089/26.36, allocations: 63.69 kB / 14.64 GB, free: 145.6 MB / 2.485 GB
Notification: Performance of Jacobian: time 1.563e-05/26.36, allocations: 4.062 kB / 14.64 GB, free: 145.6 MB / 2.485 GB
Notification: Partition statistics after passing the back-end:
 * Number of ODE partitions: ..................... 1
 * Number of algebraic partitions: ............... 0
 * Number of ODE event partitions: ............... 0
 * Number of algebraic event partitions: ......... 0
 * Number of clocked partitions: ................. 0
 * Number of initial partitions: ................. 1
 * Number of initial(lambda=0) partitions: ....... 0
Notification: Variable statistics after passing the back-end:
 * Number of states: ............................. 819200 (2) {x, v}
 * Number of discrete states: .................... 0 (0) {}
 * Number of clocked states: ..................... 0 (0) {}
 * Number of discrete variables: ................. 0 (0) {}
 * Number of clocks: ............................. 0 (0) {}
 * Number of top-level inputs: ................... 0 (0) {}
Notification: [Simulation] Strong Component statistics after passing the back-end:
 * Number of single strong components: ........... 2 (scalar:2, array:0, record:0)
 * Number of multi strong components: ............ 0 (algorithm:0, when:0, if:0, tuple:0)
 * Number of for-loop strong components: ......... 2 (resizable: 2, generic: 0, entwined:0)
 * Number of algebraic-loop strong components: ... 0 (linear: 0, nonlinear:0)
Notification: [Initialization] Strong Component statistics after passing the back-end:
 * Number of single strong components: ........... 4 (scalar:4, array:0, record:0)
 * Number of multi strong components: ............ 0 (algorithm:0, when:0, if:0, tuple:0)
 * Number of for-loop strong components: ......... 4 (resizable: 4, generic: 0, entwined:0)
 * Number of algebraic-loop strong components: ... 0 (linear: 0, nonlinear:0)
Notification: Performance of backend: time 4.196e-05/26.36, allocations: 29.36 kB / 14.64 GB, free: 145.6 MB / 2.485 GB
Notification: Performance of SimCode: time 25.94/52.3, allocations: 8.042 GB / 22.68 GB, free: 15.86 MB / 4.973 GB
Notification: Performance of Templates: time 8.013/60.31, allocations: 2.527 GB / 25.21 GB, free: 1.592 GB / 6.458 GB
"
[Timeout remaining time 340]
make -j16 -f LargeTestSuite_NB_LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600.makefile [Timeout 400]
(rm -f LargeTestSuite_NB_LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600.pipe ; mkfifo LargeTestSuite_NB_LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600.pipe ; head -c 1048576 < LargeTestSuite_NB_LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600.pipe >> ../files/LargeTestSuite_NB_LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600.sim & ./LargeTestSuite_NB_LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600  -s=gbode -gbm=dopri45 -abortSlowSimulation -alarm=400 -lv LOG_STATS > LargeTestSuite_NB_LargeTestSuite.Mechanical.HarmonicOscillator.HarmonicOscillator_N_409600.pipe 2>&1) [Timeout 400]
[Calling sys.exit(0), Time elapsed: 189.89379290677607]
Failed to read output from testmodel.py, exit status != 0:
60.31836023554206 60.333109349 60.327827873
Calling exit ...
<OMPython.OMCSessionZMQ object at 0x7f0dc5d19720>