Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Buildings_12_Buildings.Fluid.HydronicConfigurations.ActiveNetworks.Examples.DecouplingMixing.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.001179/0.001179, allocations: 98.08 kB / 19.73 MB, free: 2.23 MB / 14.72 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.001394/0.001394, allocations: 220 kB / 23.04 MB, free: 5.074 MB / 14.72 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.326/1.326, allocations: 230.6 MB / 256.8 MB, free: 7.996 MB / 206.1 MB
"
[Timeout remaining time 179]
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 12.1.1-maint.12.x/package.mo", uses=false) [Timeout 180]
"Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 12.1.1-maint.12.x/package.mo): time 2.859/2.859, allocations: 0.49 GB / 0.7959 GB, free: 33.48 MB / 0.6231 GB
"
[Timeout remaining time 177]
Using package Buildings with version 12.1.1 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 12.1.1-maint.12.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: "" <> buildModelFMU(Buildings.Fluid.HydronicConfigurations.ActiveNetworks.Examples.DecouplingMixing,fileNamePrefix="Buildings_12_Buildings_Fluid_HydronicConfigurations_ActiveNetworks_Examples_DecouplingMixing",fmuType="cs",version="2.0",platforms={"static"})
"" <> buildModelFMU(Buildings.Fluid.HydronicConfigurations.ActiveNetworks.Examples.DecouplingMixing,fileNamePrefix="Buildings_12_Buildings_Fluid_HydronicConfigurations_ActiveNetworks_Examples_DecouplingMixing",fmuType="cs",version="2.0",platforms={"static"}) [Timeout 300]
"Notification: Buildings requested package Modelica of version 4.0.0. Modelica 4.1.0 is used instead which states that it is fully compatible without conversion script needed.
Notification: Performance of FrontEnd - loaded program: time 0.001847/0.001847, allocations: 63.03 kB / 1.155 GB, free: 25.68 MB / 0.9044 GB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.3069/0.3087, allocations: 176.1 MB / 1.327 GB, free: 1.844 MB / 1.014 GB
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 12.1.1-maint.12.x/Fluid/HydronicConfigurations/Interfaces/PartialHydronicConfiguration.mo:25:3-29:67:writable] Warning: Parameter loa.con.dp1_nominal has no value, and is fixed during initialization (fixed=true), using available start value (start=0) as default value.
[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 12.1.1-maint.12.x/Fluid/HydronicConfigurations/Interfaces/PartialHydronicConfiguration.mo:25:3-29:67:writable] Warning: Parameter loa1.con.dp1_nominal has no value, and is fixed during initialization (fixed=true), using available start value (start=0) as default value.
Notification: Performance of NFInst.instantiate(Buildings.Fluid.HydronicConfigurations.ActiveNetworks.Examples.DecouplingMixing): time 2.689/2.998, allocations: 1.21 GB / 2.537 GB, free: 102.5 MB / 1.748 GB
Notification: Performance of NFInst.instExpressions: time 0.2528/3.25, allocations: 217.2 MB / 2.749 GB, free: 8.305 MB / 1.764 GB
Notification: Performance of NFInst.updateImplicitVariability: time 0.04333/3.294, allocations: 1.53 MB / 2.751 GB, free: 7.082 MB / 1.764 GB
Notification: Performance of NFTyping.typeComponents: time 0.03419/3.328, allocations: 12.36 MB / 2.763 GB, free: 10.65 MB / 1.779 GB
Notification: Performance of NFTyping.typeBindings: time 0.0907/3.419, allocations: 34.99 MB / 2.797 GB, free: 7.547 MB / 1.811 GB
Notification: Performance of NFTyping.typeClassSections: time 0.04749/3.466, allocations: 21.46 MB / 2.818 GB, free: 2.148 MB / 1.826 GB
Notification: Performance of NFFlatten.flatten: time 0.1117/3.578, allocations: 81.97 MB / 2.898 GB, free: 8 kB / 1.904 GB
Notification: Performance of NFFlatten.resolveConnections: time 0.03422/3.612, allocations: 17.92 MB / 2.915 GB, free: 13.92 MB / 1.936 GB
Notification: Performance of NFEvalConstants.evaluate: time 0.05598/3.668, allocations: 26.16 MB / 2.941 GB, free: 3.75 MB / 1.951 GB
Notification: Performance of NFSimplifyModel.simplify: time 0.03279/3.701, allocations: 18.03 MB / 2.959 GB, free: 1.676 MB / 1.967 GB
Notification: Performance of NFPackage.collectConstants: time 0.01009/3.711, allocations: 3.34 MB / 2.962 GB, free: 14.33 MB / 1.982 GB
Notification: Performance of NFFlatten.collectFunctions: time 0.04714/3.758, allocations: 21.37 MB / 2.983 GB, free: 8.926 MB / 1.998 GB
Notification: Performance of NFScalarize.scalarize: time 0.0136/3.772, allocations: 8.201 MB / 2.991 GB, free: 0.6992 MB / 1.998 GB
Notification: Performance of NFVerifyModel.verify: time 0.03492/3.807, allocations: 15.33 MB / 3.006 GB, free: 1.305 MB / 2.014 GB
Notification: Performance of NFConvertDAE.convert: time 0.09204/3.899, allocations: 54.56 MB / 3.059 GB, free: 10.57 MB / 2.076 GB
Notification: Performance of FrontEnd - DAE generated: time 5.651e-06/3.899, allocations: 0 / 3.059 GB, free: 10.57 MB / 2.076 GB
Notification: Performance of FrontEnd: time 1.313e-06/3.899, allocations: 0 / 3.059 GB, free: 10.57 MB / 2.076 GB
Notification: Performance of Transformations before backend: time 0.001376/3.9, allocations: 0 / 3.059 GB, free: 10.57 MB / 2.076 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 3674
 * Number of variables: 3674
Notification: Performance of Generate backend data structure: time 1.232/5.132, allocations: 35.18 MB / 3.093 GB, free: 0.9671 GB / 2.076 GB
Notification: Performance of prepare preOptimizeDAE: time 4.381e-05/5.132, allocations: 12.84 kB / 3.093 GB, free: 0.9671 GB / 2.076 GB
Notification: Performance of preOpt introduceOutputRealDerivatives (simulation): time 0.0004979/5.132, allocations: 377.2 kB / 3.094 GB, free: 0.9671 GB / 2.076 GB
Notification: Performance of preOpt introduceOutputAliases (simulation): time 0.006185/5.139, allocations: 1.834 MB / 3.095 GB, free: 0.9661 GB / 2.076 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.06496/5.204, allocations: 9.665 MB / 3.105 GB, free: 0.9644 GB / 2.076 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.06083/5.264, allocations: 31.74 MB / 3.136 GB, free: 0.9442 GB / 2.076 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.001395/5.266, allocations: 1.263 MB / 3.137 GB, free: 0.9436 GB / 2.076 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.006064/5.272, allocations: 1.524 MB / 3.139 GB, free: 0.9431 GB / 2.076 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.06566/5.338, allocations: 20.73 MB / 3.159 GB, free: 0.9312 GB / 2.076 GB
Notification: Performance of preOpt findStateOrder (simulation): time 0.0008412/5.338, allocations: 20.78 kB / 3.159 GB, free: 0.9312 GB / 2.076 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.005101/5.343, allocations: 0.5804 MB / 3.159 GB, free: 0.9308 GB / 2.076 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.000434/5.344, allocations: 0.5403 MB / 3.16 GB, free: 0.9307 GB / 2.076 GB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.05654/5.4, allocations: 20.81 MB / 3.18 GB, free: 0.9189 GB / 2.076 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.157/5.557, allocations: 95.89 MB / 3.274 GB, free: 0.8227 GB / 2.076 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.02883/5.586, allocations: 12.74 MB / 3.286 GB, free: 0.8107 GB / 2.076 GB
Notification: Performance of preOpt resolveLoops (simulation): time 0.0174/5.604, allocations: 7.901 MB / 3.294 GB, free: 0.8031 GB / 2.076 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 evalFunc (simulation): time 0.06054/5.664, allocations: 29.81 MB / 3.323 GB, free: 0.7743 GB / 2.076 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.02152/5.686, allocations: 8.436 MB / 3.331 GB, free: 0.7661 GB / 2.076 GB
Notification: Performance of preOpt simplifyInStream (simulation): time 0.01087/5.697, allocations: 0.9411 MB / 3.332 GB, free: 0.7652 GB / 2.076 GB
Notification: Performance of pre-optimization done (n=930): time 3.198e-05/5.697, allocations: 4 kB / 3.332 GB, free: 0.7652 GB / 2.076 GB
Notification: Performance of matching and sorting (n=954): time 0.137/5.834, allocations: 42.91 MB / 3.374 GB, free: 0.7233 GB / 2.076 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 0.0001542/5.834, allocations: 0.5607 MB / 3.375 GB, free: 0.7226 GB / 2.076 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.03947/5.873, allocations: 20.15 MB / 3.394 GB, free: 0.703 GB / 2.076 GB
Notification: Performance of collectPreVariables (initialization): time 0.003177/5.876, allocations: 261.7 kB / 3.395 GB, free: 0.7028 GB / 2.076 GB
Notification: Performance of collectInitialEqns (initialization): time 0.01102/5.887, allocations: 10.26 MB / 3.405 GB, free: 0.6928 GB / 2.076 GB
Notification: Performance of collectInitialBindings (initialization): time 0.004731/5.892, allocations: 3.406 MB / 3.408 GB, free: 0.6895 GB / 2.076 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.009817/5.902, allocations: 3.084 MB / 3.411 GB, free: 0.6865 GB / 2.076 GB
Notification: Performance of setup shared object (initialization): time 4.587e-05/5.902, allocations: 309.1 kB / 3.411 GB, free: 0.6862 GB / 2.076 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.0201/5.922, allocations: 8.989 MB / 3.42 GB, free: 0.6774 GB / 2.076 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.02399/5.946, allocations: 12.39 MB / 3.432 GB, free: 0.6641 GB / 2.076 GB
Warning: It was not possible to determine if the initialization problem is consistent, because of not evaluable parameters/start values during compile time: loa.loa.coi.heaCooHum_u.vol.dynBal.medium.p = loa.loa.coi.heaCooHum_u.vol.dynBal.p_start (loa.loa.outAir.p = loa.loa.coi.heaCooHum_u.vol.dynBal.p_start)
Warning: It was not possible to determine if the initialization problem is consistent, because of not evaluable parameters/start values during compile time: loa1.loa.coi.heaCooHum_u.vol.dynBal.medium.p = loa1.loa.coi.heaCooHum_u.vol.dynBal.p_start (loa1.loa.outAir.p = loa1.loa.coi.heaCooHum_u.vol.dynBal.p_start)
Notification: Performance of analyzeInitialSystem (initialization): time 0.225/6.171, allocations: 73.4 MB / 3.504 GB, free: 0.5915 GB / 2.076 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 9.6e-05/6.171, allocations: 20 kB / 3.504 GB, free: 0.5914 GB / 2.076 GB
Notification: Performance of matching and sorting (n=1781) (initialization): time 0.07101/6.242, allocations: 25.07 MB / 3.528 GB, free: 0.5669 GB / 2.076 GB
Notification: Performance of prepare postOptimizeDAE: time 0.0001922/6.242, allocations: 301.2 kB / 3.529 GB, free: 0.5665 GB / 2.076 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 0.0001297/6.243, allocations: 75.94 kB / 3.529 GB, free: 0.5664 GB / 2.076 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.007369/6.25, allocations: 2.492 MB / 3.531 GB, free: 0.564 GB / 2.076 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.02115/6.271, allocations: 3.818 MB / 3.535 GB, free: 0.5602 GB / 2.076 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.01999/6.291, allocations: 25.8 MB / 3.56 GB, free: 0.5337 GB / 2.076 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.02792/6.319, allocations: 1.586 MB / 3.562 GB, free: 0.5322 GB / 2.076 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.00431/6.323, allocations: 0.7685 MB / 3.562 GB, free: 0.5314 GB / 2.076 GB
Warning: The initial conditions are over specified. The following 4 initial equations are redundant, so they are removed from the initialization system:
         loa.loa.coi.heaCooHum_u.vol.dynBal.medium.p = loa.loa.coi.heaCooHum_u.vol.dynBal.p_start
         $DER.loa.loa.coiNom.heaCooHum_u.vol.dynBal.medium.p = 0.0
         loa1.loa.coi.heaCooHum_u.vol.dynBal.medium.p = loa1.loa.coi.heaCooHum_u.vol.dynBal.p_start
         $DER.loa1.loa.coiNom.heaCooHum_u.vol.dynBal.medium.p = 0.0.
Notification: Performance of preBalanceInitialSystem (initialization_lambda0): time 0.03364/6.357, allocations: 13.21 MB / 3.575 GB, free: 0.5185 GB / 2.076 GB
Notification: Performance of partitionIndependentBlocks (initialization_lambda0): time 0.02446/6.381, allocations: 12.03 MB / 3.587 GB, free: 0.5055 GB / 2.076 GB
Warning: It was not possible to determine if the initialization problem is consistent, because of not evaluable parameters/start values during compile time: loa.loa.coi.heaCooHum_u.vol.dynBal.medium.p = loa.loa.coi.heaCooHum_u.vol.dynBal.p_start (loa.loa.outAir.p = loa.loa.coi.heaCooHum_u.vol.dynBal.p_start)
Warning: It was not possible to determine if the initialization problem is consistent, because of not evaluable parameters/start values during compile time: loa1.loa.coi.heaCooHum_u.vol.dynBal.medium.p = loa1.loa.coi.heaCooHum_u.vol.dynBal.p_start (loa1.loa.outAir.p = loa1.loa.coi.heaCooHum_u.vol.dynBal.p_start)
Notification: Performance of analyzeInitialSystem (initialization_lambda0): time 0.2222/6.604, allocations: 71.49 MB / 3.657 GB, free: 445 MB / 2.076 GB
Notification: Performance of solveInitialSystemEqSystem (initialization_lambda0): time 0.0001334/6.604, allocations: 20 kB / 3.657 GB, free: 445 MB / 2.076 GB
Notification: Performance of matching and sorting (n=1781) (initialization_lambda0): time 0.07297/6.677, allocations: 24.48 MB / 3.681 GB, free: 420.4 MB / 2.076 GB
Notification: Performance of prepare postOptimizeDAE: time 0.0001865/6.677, allocations: 309 kB / 3.681 GB, free: 420.1 MB / 2.076 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 0.0001224/6.677, allocations: 68 kB / 3.681 GB, free: 420 MB / 2.076 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.006509/6.683, allocations: 2.383 MB / 3.683 GB, free: 417.6 MB / 2.076 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.02029/6.704, allocations: 3.786 MB / 3.687 GB, free: 413.8 MB / 2.076 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.02627/6.73, allocations: 30.12 MB / 3.717 GB, free: 382.2 MB / 2.076 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.02846/6.758, allocations: 1.66 MB / 3.718 GB, free: 380.5 MB / 2.076 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.004611/6.763, allocations: 0.7338 MB / 3.719 GB, free: 379.8 MB / 2.076 GB
Warning: The initial conditions are over specified. The following 4 initial equations are redundant, so they are removed from the initialization_lambda0 system:
         loa.loa.coi.heaCooHum_u.vol.dynBal.medium.p = loa.loa.coi.heaCooHum_u.vol.dynBal.p_start
         $DER.loa.loa.coiNom.heaCooHum_u.vol.dynBal.medium.p = 0.0
         loa1.loa.coi.heaCooHum_u.vol.dynBal.medium.p = loa1.loa.coi.heaCooHum_u.vol.dynBal.p_start
         $DER.loa1.loa.coiNom.heaCooHum_u.vol.dynBal.medium.p = 0.0.
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 312
 * Number of states: 0 ()
 * Number of discrete variables: 93 ($whenCondition9,$whenCondition8,$whenCondition7,$whenCondition6,$whenCondition5,$whenCondition4,$whenCondition3,$whenCondition2,$PRE.fraLoa.tab.nextTimeEvent,$whenCondition1,loa.loa.coi.flowRegime_nominal,loa.loa.coi.dryWetCalcs.fullyDry.cfg,loa.loa.coi.dryWetCalcs.fullyWet.cfg,loa.loa.coi.dryWetCalcs.cfg,loa.loa.coi.flowRegime,loa.loa.coiNom.flowRegime_nominal,loa.loa.coiNom.dryWetCalcs.fullyDry.cfg,loa.loa.coiNom.dryWetCalcs.fullyWet.cfg,loa.loa.coiNom.dryWetCalcs.cfg,loa.loa.coiNom.flowRegime,loa1.loa.coi.flowRegime_nominal,loa1.loa.coi.dryWetCalcs.fullyDry.cfg,loa1.loa.coi.dryWetCalcs.fullyWet.cfg,loa1.loa.coi.dryWetCalcs.cfg,loa1.loa.coi.flowRegime,loa1.loa.coiNom.flowRegime_nominal,loa1.loa.coiNom.dryWetCalcs.fullyDry.cfg,loa1.loa.coiNom.dryWetCalcs.fullyWet.cfg,loa1.loa.coiNom.dryWetCalcs.cfg,loa1.loa.coiNom.flowRegime,loa1.loa.coiNom.UAFroRated.isFulWet,loa1.loa.coiNom.UAFroRated.isFulDry,loa1.loa.coi.UAFroRated.isFulWet,loa1.loa.coi.UAFroRated.isFulDry,loa.loa.coiNom.UAFroRated.isFulWet,loa.loa.coiNom.UAFroRated.isFulDry,loa.loa.coi.UAFroRated.isFulWet,loa.loa.coi.UAFroRated.isFulDry,$PRE.con.ctl.cha.u,$PRE.loa.loa.ctl.cha.u,$PRE.loa1.loa.ctl.cha.u,$PRE.mode.y[1],$PRE.mode.idx,$PRE.con1.ctl.cha.u,$PRE.resT2.cha.u,con.isEna.y,con.ctl.cha.u,con.ctl.cha.y,con.ctl.cha.up,con.ctl.cha.down,con.ctl.isDis.y,con.ctl.addPar.y,loa.loa.ctl.cha.u,loa.loa.ctl.cha.y,loa.loa.ctl.cha.up,loa.loa.ctl.cha.down,loa.loa.ctl.isDis.y,loa.loa.ctl.addPar.y,loa.loa.addPar.y,loa1.loa.ctl.cha.u,loa1.loa.ctl.cha.y,loa1.loa.ctl.cha.up,loa1.loa.ctl.cha.down,loa1.loa.ctl.isDis.y,loa1.loa.ctl.addPar.y,loa1.loa.addPar.y,fraLoa.tab.nextTimeEvent,fraLoa.tab.nextTimeEventScaled,$PRE.fraLoa.tab.nextTimeEventScaled,mode.y[1],mode.idx,isEna.y,addPar.y,con1.ctl.cha.u,con1.ctl.cha.y,con1.ctl.cha.up,con1.ctl.cha.down,con1.ctl.isDis.y,con1.ctl.addPar.y,con1.isEna.y,resT2.cha.u,resT2.cha.y,resT2.cha.up,resT2.cha.down,resT2.isDis.y,resT2.addPar.y,$whenCondition10,$whenCondition11,$whenCondition12,$whenCondition13,$whenCondition14,con1.ctl.conPID.cheYMinMax.y,con.ctl.conPID.cheYMinMax.y)
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (1613):
 * Single equations (assignments): 1571
 * Array equations: 10
 * Algorithm blocks: 10
 * Record equations: 2
 * When equations: 0
 * If-equations: 0
 * Equation systems (not torn): 5
 * Torn equation systems: 15
 * Mixed (continuous/discrete) equation systems: 0
Notification: Equation system details (not torn):
 * Constant Jacobian (size): 0 systems
 * Linear Jacobian (size,density): 0 systems
 * Non-linear Jacobian (size): 5 systems
   {1, 1, 1, 1, 1}
 * Without analytic Jacobian (size): 0 systems
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): 15 systems
   {(1,2), (1,2), (7,24), (5,2), (1,10), (1,2), (1,2), (1,2), (5,2), (5,2), (1,10), (1,2), (1,2), (1,2), (5,2)}
Notification: Performance of prepare postOptimizeDAE: time 0.007822/6.771, allocations: 1.267 MB / 3.72 GB, free: 378.4 MB / 2.076 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.009273/6.78, allocations: 2.049 MB / 3.722 GB, free: 376.4 MB / 2.076 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.06232/6.843, allocations: 18.68 MB / 3.74 GB, free: 357.6 MB / 2.076 GB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 0.0001561/6.843, allocations: 108 kB / 3.741 GB, free: 357.5 MB / 2.076 GB
Notification: Performance of postOpt constantLinearSystem (simulation): time 4.409e-05/6.843, allocations: 0 / 3.741 GB, free: 357.5 MB / 2.076 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 0.04641/6.889, allocations: 14.93 MB / 3.755 GB, free: 342.4 MB / 2.076 GB
Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.1124/7.001, allocations: 47.14 MB / 3.801 GB, free: 295 MB / 2.076 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 0.0001611/7.002, allocations: 27.94 kB / 3.801 GB, free: 295 MB / 2.076 GB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.01352/7.015, allocations: 2.309 MB / 3.803 GB, free: 292.7 MB / 2.076 GB
Notification: Performance of postOpt tearingSystem (simulation): time 0.003178/7.018, allocations: 0.9988 MB / 3.804 GB, free: 291.7 MB / 2.076 GB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 0.002763/7.021, allocations: 339.8 kB / 3.805 GB, free: 291.3 MB / 2.076 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 0.007394/7.029, allocations: 10.18 MB / 3.815 GB, free: 280.5 MB / 2.076 GB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 1.527e-05/7.029, allocations: 39.91 kB / 3.815 GB, free: 280.5 MB / 2.076 GB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.07352/7.102, allocations: 28.07 MB / 3.842 GB, free: 251.8 MB / 2.076 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.01518/7.117, allocations: 4.4 MB / 3.846 GB, free: 247.4 MB / 2.076 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.009388/7.127, allocations: 247.9 kB / 3.847 GB, free: 247.1 MB / 2.076 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.02075/7.147, allocations: 1.069 MB / 3.848 GB, free: 246.1 MB / 2.076 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.003792/7.151, allocations: 0.7201 MB / 3.848 GB, free: 245.4 MB / 2.076 GB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 0.003504/7.155, allocations: 0.5307 MB / 3.849 GB, free: 244.8 MB / 2.076 GB
Notification: Performance of sorting global known variables: time 0.03237/7.187, allocations: 13.65 MB / 3.862 GB, free: 231.3 MB / 2.076 GB
Notification: Performance of sort global known variables: time 4.31e-07/7.187, allocations: 3.938 kB / 3.862 GB, free: 231.3 MB / 2.076 GB
Notification: Performance of remove unused functions: time 0.04537/7.232, allocations: 9.189 MB / 3.871 GB, free: 222.1 MB / 2.076 GB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 101
 * Number of states: 51 (resT2.conPID.I.y,con1.T2Ret.T,con1.ctl.conPID.I.y,con1.T2Sup.T,con1.pum.pumSpe.motSpe.y,con1.pum.pumSpe.vol.dynBal.U,con1.jun.vol.dynBal.U,con1.val.valEquLin.actPos.y,con1.val.valEquLin.vol.dynBal.U,jun.vol.dynBal.U,T1ConRet.T,del2.dynBal.U,ctlPum2.I.y,loa1.con.val.valEqu.actPos.y,loa1.loa.TAirLvgNom.T,loa1.loa.TLiqLvg.T,loa1.loa.TLiqEnt.T,loa1.loa.coiNom.dryWetCalcs.fullyWet.TWatOutEst,loa1.loa.coiNom.heaCooHum_u.vol.dynBal.medium.T,loa1.loa.coiNom.heaCooHum_u.vol.dynBal.medium.Xi[1],loa1.loa.coiNom.heaCoo.vol.dynBal.medium.T,loa1.loa.ctl.conPID.I.y,loa1.loa.coi.dryWetCalcs.fullyWet.TWatOutEst,loa1.loa.coi.heaCooHum_u.vol.dynBal.U,loa1.loa.coi.heaCooHum_u.vol.dynBal.medium.Xi[1],loa1.loa.coi.heaCoo.vol.dynBal.U,loa1.loa.TAirLvg.T,loa.con.val.valEqu.actPos.y,loa.loa.TAirLvgNom.T,loa.loa.TLiqLvg.T,loa.loa.TLiqEnt.T,loa.loa.coiNom.dryWetCalcs.fullyWet.TWatOutEst,loa.loa.coiNom.heaCooHum_u.vol.dynBal.medium.T,loa.loa.coiNom.heaCooHum_u.vol.dynBal.medium.Xi[1],loa.loa.coiNom.heaCoo.vol.dynBal.medium.T,loa.loa.ctl.conPID.I.y,loa.loa.coi.dryWetCalcs.fullyWet.TWatOutEst,loa.loa.coi.heaCooHum_u.vol.dynBal.U,loa.loa.coi.heaCooHum_u.vol.dynBal.medium.Xi[1],loa.loa.coi.heaCoo.vol.dynBal.U,loa.loa.TAirLvg.T,con.T2Ret.T,con.T2Sup.T,con.val.valEqu.actPos.y,con.junBypRet.vol.dynBal.U,con.junBypSup.vol.dynBal.U,del1.dynBal.U,T1Sup.T,T1Ret.T,pum.pumDp.motSpe.y,pum.pumDp.vol.dynBal.U)
 * Number of discrete variables: 54 (con1.ctl.cha.y,resT2.cha.y,loa.loa.ctl.cha.y,loa1.loa.ctl.cha.y,isEna.y,$whenCondition14,$whenCondition13,$whenCondition12,$whenCondition11,$whenCondition10,$whenCondition9,$whenCondition8,$whenCondition7,$whenCondition6,$whenCondition5,$whenCondition4,$whenCondition3,$whenCondition2,$whenCondition1,resT2.addPar.y,resT2.isDis.y,resT2.cha.down,resT2.cha.up,resT2.cha.u,con1.isEna.y,con1.ctl.addPar.y,con1.ctl.isDis.y,con1.ctl.cha.down,con1.ctl.cha.up,con1.ctl.cha.u,addPar.y,mode.idx,mode.y[1],fraLoa.tab.nextTimeEventScaled,fraLoa.tab.nextTimeEvent,loa1.loa.addPar.y,loa1.loa.ctl.addPar.y,loa1.loa.ctl.isDis.y,loa1.loa.ctl.cha.down,loa1.loa.ctl.cha.up,loa1.loa.ctl.cha.u,loa.loa.addPar.y,loa.loa.ctl.addPar.y,loa.loa.ctl.isDis.y,loa.loa.ctl.cha.down,loa.loa.ctl.cha.up,loa.loa.ctl.cha.u,con.ctl.addPar.y,con.ctl.isDis.y,con.ctl.cha.down,con.ctl.cha.up,con.ctl.cha.y,con.ctl.cha.u,con.isEna.y)
 * Number of discrete states: 7 (fraLoa.tab.nextTimeEvent,con.ctl.cha.u,loa1.loa.ctl.cha.u,loa.loa.ctl.cha.u,resT2.cha.u,con1.ctl.cha.u,fraLoa.tab.nextTimeEventScaled)
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for simulation (989):
 * Single equations (assignments): 934
 * Array equations: 0
 * Algorithm blocks: 10
 * Record equations: 31
 * When equations: 4
 * If-equations: 0
 * Equation systems (not torn): 1
 * Torn equation systems: 9
 * Mixed (continuous/discrete) equation systems: 0
Notification: Equation system details (not torn):
 * Constant Jacobian (size): 0 systems
 * Linear Jacobian (size,density): 0 systems
 * Non-linear Jacobian (size): 1 system
   {1}
 * Without analytic Jacobian (size): 0 systems
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): 9 systems
   {(1,2), (1,2), (7,25), (1,2), (1,2), (1,1), (1,1), (1,1), (1,1)}
Notification: Performance of Backend phase and start with SimCode phase: time 0.07896/7.311, allocations: 31.83 MB / 3.902 GB, free: 190 MB / 2.076 GB
Notification: Performance of simCode: created initialization part: time 0.08366/7.395, allocations: 32.67 MB / 3.934 GB, free: 157 MB / 2.076 GB
Notification: Performance of simCode: created event and clocks part: time 2.562e-05/7.395, allocations: 14.84 kB / 3.934 GB, free: 157 MB / 2.076 GB
Notification: Performance of simCode: created simulation system equations: time 0.02026/7.415, allocations: 8.491 MB / 3.943 GB, free: 148.3 MB / 2.076 GB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.05328/7.469, allocations: 10.99 MB / 3.953 GB, free: 137.6 MB / 2.076 GB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 1.024/8.493, allocations: 172.4 MB / 4.122 GB, free: 0.9079 GB / 2.076 GB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.01325/8.506, allocations: 9.499 MB / 4.131 GB, free: 0.9068 GB / 2.076 GB
Notification: Performance of simCode: alias equations: time 0.02567/8.532, allocations: 5.309 MB / 4.136 GB, free: 0.9066 GB / 2.076 GB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.01846/8.55, allocations: 10.48 MB / 4.146 GB, free: 0.9 GB / 2.076 GB
Notification: Performance of SimCode: time 1.143e-06/8.55, allocations: 0 / 4.146 GB, free: 0.9 GB / 2.076 GB
Notification: Performance of buildModelFMU: Generate the FMI files: time 0.7383/9.288, allocations: 0.6038 GB / 4.75 GB, free: 360.9 MB / 2.076 GB
Notification: Performance of buildModelFMU: Generate platform static: time 97.31/106.6, allocations: 15.92 kB / 4.75 GB, free: 360.9 MB / 2.076 GB
"
[Timeout remaining time 193]
(rm -f Buildings_12_Buildings.Fluid.HydronicConfigurations.ActiveNetworks.Examples.DecouplingMixing.pipe ; mkfifo Buildings_12_Buildings.Fluid.HydronicConfigurations.ActiveNetworks.Examples.DecouplingMixing.pipe ; head -c 1048576 < Buildings_12_Buildings.Fluid.HydronicConfigurations.ActiveNetworks.Examples.DecouplingMixing.pipe >> ../files/Buildings_12_Buildings.Fluid.HydronicConfigurations.ActiveNetworks.Examples.DecouplingMixing.sim & /home/hudson/saved_omc/OMSimulator/install/bin/OMSimulator -r=Buildings_12_Buildings.Fluid.HydronicConfigurations.ActiveNetworks.Examples.DecouplingMixing_res.mat --tempDir=temp_Buildings_12_Buildings_Fluid_HydronicConfigurations_ActiveNetworks_Examples_DecouplingMixing_fmu --startTime=0 --stopTime=86400 --stepSize=34.56 --timeout=400 --tolerance=1e-06 Buildings_12_Buildings_Fluid_HydronicConfigurations_ActiveNetworks_Examples_DecouplingMixing.fmu > Buildings_12_Buildings.Fluid.HydronicConfigurations.ActiveNetworks.Examples.DecouplingMixing.pipe 2>&1) [Timeout 420.0]
[Calling os._exit(0), Time elapsed: 115.04141986300237]
Failed to read output from testmodel.py, exit status != 0:
107.21884085901547 107.229077281 103.327802426
Calling exit ...
<OMPython.OMCSessionZMQ object at 0x7f1dbf7933a0>