Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Buildings_13_Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.1.0+maint.om/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.1.0+maint.om/package.mo): time 0.001889/0.001889, allocations: 80.88 kB / 21.56 MB, free: 2.93 MB / 18.57 MB
"
[Timeout remaining time 180]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.1.0+maint.om/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.1.0+maint.om/package.mo): time 0.002176/0.002176, allocations: 165.9 kB / 24.97 MB, free: 9.195 MB / 18.57 MB
"
[Timeout remaining time 180]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.1.0+maint.om/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.1.0+maint.om/package.mo): time 1.606/1.606, allocations: 177.1 MB / 205.4 MB, free: 5.004 MB / 186.7 MB
"
[Timeout remaining time 178]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 13.0.2-maint.13.x/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 13.0.2-maint.13.x/package.mo): time 3.214/3.214, allocations: 389.5 MB / 0.6361 GB, free: 12.29 MB / 0.6042 GB
"
[Timeout remaining time 176]
Using package Buildings with version 13.0.2 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 13.0.2-maint.13.x/package.mo)
Using package Modelica with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.1.0+maint.om/package.mo)
Using package Complex with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.1.0+maint.om/package.mo)
Using package ModelicaServices with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.1.0+maint.om/package.mo)
Running command: translateModel(Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource,tolerance=1e-06,outputFormat="empty",numberOfIntervals=2500,variableFilter="",fileNamePrefix="Buildings_13_Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource")
translateModel(Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource,tolerance=1e-06,outputFormat="empty",numberOfIntervals=2500,variableFilter="",fileNamePrefix="Buildings_13_Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource") [Timeout 300]
"Notification: Performance of FrontEnd - Absyn->SCode: time 2.314e-05/2.314e-05, allocations: 2.312 kB / 0.7759 GB, free: 5.367 MB / 0.7292 GB
Notification: Performance of NFInst.instantiate(Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource): time 0.2707/0.2708, allocations: 168.3 MB / 0.9403 GB, free: 12.65 MB / 0.9011 GB
Notification: Performance of NFInst.instExpressions: time 0.02334/0.2941, allocations: 9.03 MB / 0.9491 GB, free: 3.609 MB / 0.9011 GB
Notification: Performance of NFInst.updateImplicitVariability: time 0.005032/0.2991, allocations: 178.5 kB / 0.9493 GB, free: 3.434 MB / 0.9011 GB
Notification: Performance of NFTyping.typeComponents: time 0.003137/0.3023, allocations: 0.8026 MB / 0.9501 GB, free: 2.625 MB / 0.9011 GB
Notification: Performance of NFTyping.typeBindings: time 0.01027/0.3125, allocations: 3.341 MB / 0.9533 GB, free: 15.27 MB / 0.9167 GB
Notification: Performance of NFTyping.typeClassSections: time 0.006652/0.3192, allocations: 2.288 MB / 0.9556 GB, free: 12.97 MB / 0.9167 GB
Notification: Performance of NFFlatten.flatten: time 0.0166/0.3358, allocations: 9.767 MB / 0.9651 GB, free: 3.18 MB / 0.9167 GB
Notification: Performance of NFFlatten.resolveConnections: time 0.009041/0.3448, allocations: 3.135 MB / 0.9682 GB, free: 68 kB / 0.9167 GB
Notification: Performance of NFEvalConstants.evaluate: time 0.01821/0.3631, allocations: 5.573 MB / 0.9736 GB, free: 10.65 MB / 0.9323 GB
Notification: Performance of NFSimplifyModel.simplify: time 0.006341/0.3694, allocations: 2.439 MB / 0.976 GB, free: 8.207 MB / 0.9323 GB
Notification: Performance of NFPackage.collectConstants: time 0.001234/0.3706, allocations: 316 kB / 0.9763 GB, free: 7.898 MB / 0.9323 GB
Notification: Performance of NFFlatten.collectFunctions: time 0.003749/0.3744, allocations: 0.8697 MB / 0.9771 GB, free: 7.027 MB / 0.9323 GB
Notification: Performance of combineBinaries: time 0.01272/0.3871, allocations: 6.954 MB / 0.9839 GB, free: 36 kB / 0.9323 GB
Notification: Performance of replaceArrayConstructors: time 0.006659/0.3938, allocations: 4.153 MB / 0.988 GB, free: 11.86 MB / 0.948 GB
Notification: Performance of NFVerifyModel.verify: time 0.002006/0.3958, allocations: 351.9 kB / 0.9883 GB, free: 11.51 MB / 0.948 GB
Notification: Performance of FrontEnd: time 0.0006761/0.3964, allocations: 119.5 kB / 0.9884 GB, free: 11.39 MB / 0.948 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 693 (613)
 * Number of variables: 693 (527)
Notification: Performance of [SIM] Bindings: time 0.03973/0.4362, allocations: 20.17 MB / 1.008 GB, free: 6.652 MB / 0.9636 GB
Notification: Performance of [SIM] FunctionAlias: time 0.008177/0.4443, allocations: 3.484 MB / 1.012 GB, free: 3.051 MB / 0.9636 GB
Notification: Performance of [SIM] Early Inline: time 0.05213/0.4965, allocations: 15.45 MB / 1.027 GB, free: 3.449 MB / 0.9792 GB
Notification: Performance of [SIM] Simplify 1: time 0.00334/0.4998, allocations: 1.267 MB / 1.028 GB, free: 2.07 MB / 0.9792 GB
Warning: NBAlias.selectStartByConfidence: Alias set with conflicting unfixed start values of equal confidence detected. Use -d=dumprepl for more information.
Notification: Performance of [SIM] Alias: time 0.02784/0.5277, allocations: 13.77 MB / 1.041 GB, free: 3.16 MB / 0.9948 GB
Notification: Performance of [SIM] Simplify 2: time 0.002499/0.5302, allocations: 1.063 MB / 1.042 GB, free: 2.008 MB / 0.9948 GB
Notification: Performance of [SIM] Remove Stream: time 0.001661/0.5318, allocations: 0.9582 MB / 1.043 GB, free: 0.9648 MB / 0.9948 GB
Notification: Performance of [SIM] Detect States: time 0.004396/0.5362, allocations: 2.812 MB / 1.046 GB, free: 14.05 MB / 1.01 GB
Notification: Performance of [SIM] Events: time 0.001308/0.5375, allocations: 0.9135 MB / 1.047 GB, free: 13.14 MB / 1.01 GB
Notification: Performance of [SIM] Partitioning: time 0.006852/0.5444, allocations: 3.856 MB / 1.051 GB, free: 8.961 MB / 1.01 GB
Notification: Performance of [SIM] Causalize: time 0.01285/0.5572, allocations: 6.556 MB / 1.057 GB, free: 2.16 MB / 1.01 GB
Notification: Performance of [SIM] After Index Reduction Inline: time 0.5342/1.091, allocations: 7.848 MB / 1.065 GB, free: 89.36 MB / 1.01 GB
Notification: Performance of [INI] Simplify: time 0.01267/1.104, allocations: 5.998 MB / 1.071 GB, free: 87.72 MB / 1.01 GB
Notification: Performance of [INI] Inline: time 0.02586/1.13, allocations: 16.21 MB / 1.086 GB, free: 87.39 MB / 1.01 GB
Notification: Performance of [INI] Partitioning: time 0.001038/1.131, allocations: 232.1 kB / 1.087 GB, free: 87.2 MB / 1.01 GB
Notification: Performance of [INI] Cleanup: time 0.004152/1.135, allocations: 3.631 MB / 1.09 GB, free: 87.05 MB / 1.01 GB
Notification: Performance of [INI] Causalize: time 0.02474/1.16, allocations: 15.55 MB / 1.105 GB, free: 84.43 MB / 1.01 GB
Notification: Performance of [INI] Tearing: time 0.0008511/1.161, allocations: 0.9284 MB / 1.106 GB, free: 84.02 MB / 1.01 GB
Notification: Performance of [SIM] Initialization: time 1.813e-06/1.161, allocations: 2.719 kB / 1.106 GB, free: 84.02 MB / 1.01 GB
Notification: Performance of [SIM] Remove Dummies: time 6.004e-05/1.161, allocations: 10.44 kB / 1.106 GB, free: 84.01 MB / 1.01 GB
Notification: Performance of [SIM] Tearing: time 0.000501/1.161, allocations: 0.5606 MB / 1.107 GB, free: 83.76 MB / 1.01 GB
Notification: Performance of [SIM] Categorize: time 6.504e-05/1.161, allocations: 21.7 kB / 1.107 GB, free: 83.76 MB / 1.01 GB
Notification: Performance of [SIM] Solve: time 0.01016/1.172, allocations: 4.998 MB / 1.112 GB, free: 83.51 MB / 1.01 GB
Notification: Performance of [SIM] Jacobian: time 0.009507/1.181, allocations: 6.319 MB / 1.118 GB, free: 81.25 MB / 1.01 GB
Notification: Performance of [SIM] Minimize Homotopy System: time 1.106e-05/1.181, allocations: 0 / 1.118 GB, free: 81.25 MB / 1.01 GB
Notification: Partition statistics after passing the back-end:
 * Number of ODE partitions: ..................... 0
 * Number of algebraic partitions: ............... 16
 * Number of ODE event partitions: ............... 1
 * Number of algebraic event partitions: ......... 0
 * Number of clocked partitions: ................. 0
 * Number of initial partitions: ................. 1
 * Number of initial(lambda=0) partitions: ....... 1
Notification: Variable statistics after passing the back-end:
 * Number of states: ............................. 20 (20) {vol.U, vol.dynBal.m, vol.Xi, vol.mC, vol1.U, vol1.dynBal.m, vol1.Xi, vol1.mC, vol2.U, vol2.dynBal.m, vol2.Xi, vol2.mC, vol3.U, vol3.dynBal.m, vol3.Xi, vol3.mC, vol4.U, vol4.dynBal.m, vol4.Xi, vol4.mC}
 * Number of discrete states: .................... 0 (0) {}
 * Number of clocked states: ..................... 0 (0) {}
 * Number of discrete variables: ................. 1 (1) {$SEV_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: ........... 458 (scalar:428, array:30, record:0)
 * Number of multi strong components: ............ 0 (algorithm:0, when:0, if:0, tuple:0)
 * Number of for-loop strong components: ......... 33 (resizable: 33, generic: 0, entwined:0)
 * Number of algebraic-loop strong components: ... 7 (linear: 0, nonlinear:7)
Notification: [Initialization] Strong Component statistics after passing the back-end:
 * Number of single strong components: ........... 561 (scalar:496, array:65, record:0)
 * Number of multi strong components: ............ 0 (algorithm:0, when:0, if:0, tuple:0)
 * Number of for-loop strong components: ......... 33 (resizable: 33, generic: 0, entwined:0)
 * Number of algebraic-loop strong components: ... 7 (linear: 0, nonlinear:7)
Notification: [Initialization (lambda=0)] Strong Component statistics after passing the back-end:
 * Number of single strong components: ........... 575 (scalar:510, array:65, record:0)
 * Number of multi strong components: ............ 0 (algorithm:0, when:0, if:0, tuple:0)
 * Number of for-loop strong components: ......... 33 (resizable: 33, generic: 0, entwined:0)
 * Number of algebraic-loop strong components: ... 0 (linear: 0, nonlinear:0)
Notification: Performance of backend: time 0.0002712/1.181, allocations: 260.2 kB / 1.118 GB, free: 81.02 MB / 1.01 GB
Notification: Performance of SimCode: time 0.02702/1.208, allocations: 15.1 MB / 1.133 GB, free: 77.17 MB / 1.01 GB
Notification: Performance of Templates: time 0.07007/1.278, allocations: 41.27 MB / 1.173 GB, free: 64.71 MB / 1.01 GB
"
[Timeout remaining time 299]
make -j1 -f Buildings_13_Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource.makefile [Timeout 300]
(rm -f Buildings_13_Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource.pipe ; mkfifo Buildings_13_Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource.pipe ; head -c 1048576 < Buildings_13_Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource.pipe >> ../files/Buildings_13_Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource.sim & ./Buildings_13_Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource -abortSlowSimulation -alarm=240  -lv LOG_STATS > Buildings_13_Buildings.Fluid.Sources.Examples.TraceSubstancesFlowSource.pipe 2>&1) [Timeout 240]
[Calling sys.exit(0), Time elapsed: 11.624364322051406]