Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr IBPSA_latest_IBPSA.Airflow.Multizone.Examples.OneRoom.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/IBPSA 4.0.0-master/package.mo", uses=false)
Using package IBPSA with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/IBPSA 4.0.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)
Running command: translateModel(IBPSA.Airflow.Multizone.Examples.OneRoom,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="IBPSA_latest_IBPSA.Airflow.Multizone.Examples.OneRoom")
translateModel(IBPSA.Airflow.Multizone.Examples.OneRoom,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="IBPSA_latest_IBPSA.Airflow.Multizone.Examples.OneRoom")
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.001285/0.001285, allocations: 104.4 kB / 16.52 MB, free: 6.727 MB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo): time 0.001181/0.001181, allocations: 195.2 kB / 17.45 MB, free: 6.051 MB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo): time 1.302/1.302, allocations: 222.9 MB / 241.1 MB, free: 13.79 MB / 206.1 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/IBPSA 4.0.0-master/package.mo): time 0.7252/0.7252, allocations: 115.3 MB / 406.6 MB, free: 6.469 MB / 318.1 MB
Notification: Performance of FrontEnd - loaded program: time 0.001251/0.001251, allocations: 63.89 kB / 493.6 MB, free: 0.8555 MB / 398.1 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.3382/0.3395, allocations: 76.17 MB / 0.5564 GB, free: 35.48 MB / 446.1 MB
Notification: Performance of NFInst.instantiate(IBPSA.Airflow.Multizone.Examples.OneRoom): time 0.5465/0.8861, allocations: 211.4 MB / 0.7628 GB, free: 1.805 MB / 0.5762 GB
Notification: Performance of NFInst.instExpressions: time 0.01357/0.8997, allocations: 10.31 MB / 0.7729 GB, free: 1.691 MB / 0.5762 GB
Notification: Performance of NFInst.updateImplicitVariability: time 0.001853/0.9016, allocations: 33.75 kB / 0.7729 GB, free: 1.691 MB / 0.5762 GB
Notification: Performance of NFTyping.typeComponents: time 0.002212/0.9038, allocations: 0.7335 MB / 0.7736 GB, free: 1.672 MB / 0.5762 GB
Notification: Performance of NFTyping.typeBindings: time 0.007611/0.9114, allocations: 2.725 MB / 0.7763 GB, free: 1.527 MB / 0.5762 GB
Notification: Performance of NFTyping.typeClassSections: time 0.003651/0.9151, allocations: 1.289 MB / 0.7776 GB, free: 1.48 MB / 0.5762 GB
Notification: Performance of NFFlatten.flatten: time 0.006247/0.9214, allocations: 4.646 MB / 0.7821 GB, free: 1.469 MB / 0.5762 GB
Notification: Performance of NFFlatten.resolveConnections: time 0.001495/0.9229, allocations: 0.8676 MB / 0.7829 GB, free: 1.332 MB / 0.5762 GB
Notification: Performance of NFEvalConstants.evaluate: time 0.002371/0.9253, allocations: 0.9851 MB / 0.7839 GB, free: 1.332 MB / 0.5762 GB
Notification: Performance of NFSimplifyModel.simplify: time 0.002531/0.9278, allocations: 1.115 MB / 0.785 GB, free: 1.328 MB / 0.5762 GB
Notification: Performance of NFPackage.collectConstants: time 0.0001942/0.928, allocations: 68.83 kB / 0.7851 GB, free: 1.328 MB / 0.5762 GB
Notification: Performance of NFFlatten.collectFunctions: time 0.006765/0.9348, allocations: 3.197 MB / 0.7882 GB, free: 1.301 MB / 0.5762 GB
Notification: Performance of NFScalarize.scalarize: time 0.0006395/0.9354, allocations: 451.9 kB / 0.7886 GB, free: 1.293 MB / 0.5762 GB
Notification: Performance of NFVerifyModel.verify: time 0.001091/0.9365, allocations: 0.6698 MB / 0.7893 GB, free: 1.289 MB / 0.5762 GB
Notification: Performance of NFConvertDAE.convert: time 0.002997/0.9395, allocations: 2.062 MB / 0.7913 GB, free: 1.148 MB / 0.5762 GB
Notification: Performance of FrontEnd - DAE generated: time 4.158e-06/0.9396, allocations: 0 / 0.7913 GB, free: 1.148 MB / 0.5762 GB
Notification: Performance of FrontEnd: time 1.042e-06/0.9396, allocations: 2.281 kB / 0.7913 GB, free: 1.148 MB / 0.5762 GB
Notification: Performance of Transformations before backend: time 1.613e-05/0.9396, allocations: 0 / 0.7913 GB, free: 1.148 MB / 0.5762 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 244
 * Number of variables: 244
Notification: Performance of Generate backend data structure: time 0.004235/0.9438, allocations: 1.794 MB / 0.793 GB, free: 16.28 MB / 0.5919 GB
Notification: Performance of prepare preOptimizeDAE: time 4.502e-05/0.9439, allocations: 14.22 kB / 0.793 GB, free: 16.27 MB / 0.5919 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.003052/0.9469, allocations: 431.5 kB / 0.7935 GB, free: 16.2 MB / 0.5919 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.00133/0.9483, allocations: 0.8486 MB / 0.7943 GB, free: 15.87 MB / 0.5919 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 4.695e-05/0.9483, allocations: 86.14 kB / 0.7944 GB, free: 15.86 MB / 0.5919 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.0001398/0.9485, allocations: 103 kB / 0.7945 GB, free: 15.85 MB / 0.5919 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.001831/0.9503, allocations: 1.199 MB / 0.7956 GB, free: 15.71 MB / 0.5919 GB
Notification: Performance of preOpt findStateOrder (simulation): time 2.764e-05/0.9504, allocations: 0 / 0.7956 GB, free: 15.71 MB / 0.5919 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0001026/0.9505, allocations: 41.94 kB / 0.7957 GB, free: 15.71 MB / 0.5919 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 5.684e-05/0.9505, allocations: 52.84 kB / 0.7957 GB, free: 15.71 MB / 0.5919 GB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.001684/0.9522, allocations: 1.068 MB / 0.7968 GB, free: 15.71 MB / 0.5919 GB
Warning: The model contains alias variables with redundant start and/or conflicting nominal values. It is recommended to resolve the conflicts, because otherwise the system could be hard to solve. To print the conflicting alias sets and the chosen candidates please use -d=aliasConflicts.
Notification: Performance of preOpt removeSimpleEquations (simulation): time 0.005281/0.9575, allocations: 4.734 MB / 0.8014 GB, free: 13 MB / 0.5919 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.001466/0.959, allocations: 0.9932 MB / 0.8024 GB, free: 12.76 MB / 0.5919 GB
Notification: Performance of preOpt resolveLoops (simulation): time 0.0009389/0.96, allocations: 0.572 MB / 0.8029 GB, free: 12.74 MB / 0.5919 GB
Notification: Performance of preOpt evalFunc (simulation): time 0.0006274/0.9606, allocations: 0.6719 MB / 0.8036 GB, free: 11.99 MB / 0.5919 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 3.509e-05/0.9606, allocations: 44.34 kB / 0.8036 GB, free: 11.95 MB / 0.5919 GB
Notification: Performance of pre-optimization done (n=82): time 3.286e-06/0.9606, allocations: 0 / 0.8036 GB, free: 11.95 MB / 0.5919 GB
Notification: Performance of matching and sorting (n=83): time 0.004252/0.9649, allocations: 2.291 MB / 0.8059 GB, free: 11.46 MB / 0.5919 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 3.993e-05/0.965, allocations: 63.03 kB / 0.8059 GB, free: 11.4 MB / 0.5919 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.0007891/0.9658, allocations: 0.6384 MB / 0.8065 GB, free: 11.27 MB / 0.5919 GB
Notification: Performance of collectPreVariables (initialization): time 6.587e-05/0.9658, allocations: 47.36 kB / 0.8066 GB, free: 11.24 MB / 0.5919 GB
Notification: Performance of collectInitialEqns (initialization): time 0.0003788/0.9662, allocations: 457 kB / 0.807 GB, free: 11.03 MB / 0.5919 GB
Notification: Performance of collectInitialBindings (initialization): time 0.000284/0.9665, allocations: 296.5 kB / 0.8073 GB, free: 10.84 MB / 0.5919 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.0002405/0.9668, allocations: 133.6 kB / 0.8074 GB, free: 10.82 MB / 0.5919 GB
Notification: Performance of setup shared object (initialization): time 0.0001744/0.9669, allocations: 398.5 kB / 0.8078 GB, free: 10.51 MB / 0.5919 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.0004976/0.9674, allocations: 319.3 kB / 0.8081 GB, free: 10.5 MB / 0.5919 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.0005197/0.968, allocations: 426.1 kB / 0.8085 GB, free: 10.42 MB / 0.5919 GB
Notification: Performance of analyzeInitialSystem (initialization): time 0.001065/0.969, allocations: 0.789 MB / 0.8093 GB, free: 10.33 MB / 0.5919 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 2.404e-06/0.9691, allocations: 0 / 0.8093 GB, free: 10.33 MB / 0.5919 GB
Notification: Performance of matching and sorting (n=97) (initialization): time 0.001395/0.9705, allocations: 0.948 MB / 0.8102 GB, free: 10.22 MB / 0.5919 GB
Notification: Performance of prepare postOptimizeDAE: time 1.76e-05/0.9705, allocations: 9.312 kB / 0.8102 GB, free: 10.21 MB / 0.5919 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 8.005e-06/0.9705, allocations: 1.781 kB / 0.8102 GB, free: 10.21 MB / 0.5919 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.0002419/0.9707, allocations: 58.08 kB / 0.8103 GB, free: 10.21 MB / 0.5919 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0006622/0.9714, allocations: 154.1 kB / 0.8104 GB, free: 10.21 MB / 0.5919 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.000446/0.9719, allocations: 0.6139 MB / 0.811 GB, free: 9.684 MB / 0.5919 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.001048/0.9729, allocations: 110.2 kB / 0.8111 GB, free: 9.66 MB / 0.5919 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 5.111e-05/0.973, allocations: 24 kB / 0.8112 GB, free: 9.66 MB / 0.5919 GB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 9
 * Number of states: 0 ()
 * Number of discrete variables: 0 ()
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (92):
 * Single equations (assignments): 91
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (not torn): 0
 * Torn equation systems: 1
 * Mixed (continuous/discrete) equation systems: 0
Notification: Torn system details for strict tearing set:
 * Linear torn systems (#iteration vars, #inner vars, density): 0 systems
 * Non-linear torn systems (#iteration vars, #inner vars): 1 system
   {(1,5)}
Notification: Performance of prepare postOptimizeDAE: time 0.0004344/0.9734, allocations: 302 kB / 0.8114 GB, free: 9.547 MB / 0.5919 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0001571/0.9736, allocations: 92.88 kB / 0.8115 GB, free: 9.5 MB / 0.5919 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.001501/0.9751, allocations: 0.9353 MB / 0.8124 GB, free: 9.387 MB / 0.5919 GB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 1.159e-05/0.9751, allocations: 7.969 kB / 0.8125 GB, free: 9.387 MB / 0.5919 GB
Notification: Performance of postOpt constantLinearSystem (simulation): time 7.354e-06/0.9751, allocations: 4.922 kB / 0.8125 GB, free: 9.383 MB / 0.5919 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 0.00125/0.9764, allocations: 0.9264 MB / 0.8134 GB, free: 9.039 MB / 0.5919 GB
Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.002991/0.9794, allocations: 2.112 MB / 0.8154 GB, free: 8.332 MB / 0.5919 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 5.781e-06/0.9794, allocations: 6.438 kB / 0.8154 GB, free: 8.328 MB / 0.5919 GB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.0009178/0.9803, allocations: 186.3 kB / 0.8156 GB, free: 8.305 MB / 0.5919 GB
Notification: Performance of postOpt tearingSystem (simulation): time 6.572e-06/0.9804, allocations: 2.188 kB / 0.8156 GB, free: 8.305 MB / 0.5919 GB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 5.445e-05/0.9804, allocations: 21.48 kB / 0.8156 GB, free: 8.301 MB / 0.5919 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 4.989e-06/0.9804, allocations: 2.562 kB / 0.8156 GB, free: 8.301 MB / 0.5919 GB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 1.884e-06/0.9804, allocations: 0 / 0.8156 GB, free: 8.301 MB / 0.5919 GB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.001788/0.9822, allocations: 1.398 MB / 0.817 GB, free: 7.957 MB / 0.5919 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.0004275/0.9827, allocations: 244.9 kB / 0.8172 GB, free: 7.797 MB / 0.5919 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.0001241/0.9828, allocations: 18.5 kB / 0.8172 GB, free: 7.797 MB / 0.5919 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.0008322/0.9836, allocations: 87.97 kB / 0.8173 GB, free: 7.762 MB / 0.5919 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.0001187/0.9838, allocations: 56.89 kB / 0.8174 GB, free: 7.738 MB / 0.5919 GB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 5.377e-05/0.9838, allocations: 27.36 kB / 0.8174 GB, free: 7.734 MB / 0.5919 GB
Notification: Performance of sorting global known variables: time 0.0004962/0.9843, allocations: 456.9 kB / 0.8178 GB, free: 7.578 MB / 0.5919 GB
Notification: Performance of sort global known variables: time 2.5e-07/0.9843, allocations: 0 / 0.8178 GB, free: 7.578 MB / 0.5919 GB
Notification: Performance of remove unused functions: time 0.000877/0.9852, allocations: 320.2 kB / 0.8182 GB, free: 7.57 MB / 0.5919 GB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 1
 * Number of states: 8 (volEas.dynBal.medium.Xi[1],volEas.dynBal.U,volEas.dynBal.m,oriOutBot.mExc,oriOutTop.mExc,volOut.dynBal.medium.Xi[1],volOut.dynBal.U,volOut.dynBal.m)
 * Number of discrete variables: 0 ()
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for simulation (83):
 * Single equations (assignments): 83
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (not torn): 0
 * Torn equation systems: 0
 * Mixed (continuous/discrete) equation systems: 0
Notification: Performance of Backend phase and start with SimCode phase: time 0.0003257/0.9855, allocations: 209.8 kB / 0.8184 GB, free: 7.453 MB / 0.5919 GB
Notification: Performance of simCode: created initialization part: time 0.001254/0.9868, allocations: 0.8127 MB / 0.8191 GB, free: 7.336 MB / 0.5919 GB
Notification: Performance of simCode: created event and clocks part: time 4.048e-06/0.9868, allocations: 4.141 kB / 0.8192 GB, free: 7.336 MB / 0.5919 GB
Notification: Performance of simCode: created simulation system equations: time 0.0005495/0.9874, allocations: 435.1 kB / 0.8196 GB, free: 7.293 MB / 0.5919 GB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.002404/0.9898, allocations: 0.573 MB / 0.8201 GB, free: 7.105 MB / 0.5919 GB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.003673/0.9935, allocations: 2.808 MB / 0.8229 GB, free: 5.414 MB / 0.5919 GB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.0006181/0.9941, allocations: 1.124 MB / 0.824 GB, free: 4.547 MB / 0.5919 GB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.0003001/0.9944, allocations: 81.34 kB / 0.824 GB, free: 4.539 MB / 0.5919 GB
Notification: Performance of SimCode: time 5.51e-07/0.9944, allocations: 4 kB / 0.824 GB, free: 4.535 MB / 0.5919 GB
Notification: Performance of Templates: time 0.02358/1.018, allocations: 18.68 MB / 0.8423 GB, free: 3.848 MB / 0.6075 GB
make -j1 -f IBPSA_latest_IBPSA.Airflow.Multizone.Examples.OneRoom.makefile
(rm -f IBPSA_latest_IBPSA.Airflow.Multizone.Examples.OneRoom.pipe ; mkfifo IBPSA_latest_IBPSA.Airflow.Multizone.Examples.OneRoom.pipe ; head -c 1048576 < IBPSA_latest_IBPSA.Airflow.Multizone.Examples.OneRoom.pipe >> ../files/IBPSA_latest_IBPSA.Airflow.Multizone.Examples.OneRoom.sim & ./IBPSA_latest_IBPSA.Airflow.Multizone.Examples.OneRoom  -abortSlowSimulation -alarm=480 -lv LOG_STATS > IBPSA_latest_IBPSA.Airflow.Multizone.Examples.OneRoom.pipe 2>&1)