Running: ./testmodel.py --libraries=/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr PowerSystems_master_PowerSystems.Examples.Generic.Network.NetworkLoop_dq0.conf.json
Using package PowerSystems with version 1.0.0 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/PowerSystems 1.0.0-master/package.mo)
Using package ModelicaServices with version 3.2.2 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 3.2.2+maint.om/package.mo)
Using package Modelica with version 3.2.2 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.2+maint.om/package.mo)
Using package Complex with version 3.2.2 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.2+maint.om/package.mo)
Running command: translateModel(PowerSystems.Examples.Generic.Network.NetworkLoop_dq0,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="PowerSystems_master_PowerSystems.Examples.Generic.Network.NetworkLoop_dq0")
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.2+maint.om/package.mo): time 0.002387/0.002391, allocations: 352.4 kB / 16.57 MB, free: 5.59 MB / 13.93 MB
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.2+maint.om/package.mo): time 3.162/3.162, allocations: 388.9 MB / 406.2 MB, free: 6.992 MB / 202.7 MB
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 3.2.2+maint.om/package.mo): time 0.003409/0.003408, allocations: 230.7 kB / 451.6 MB, free: 0.5977 MB / 202.7 MB
Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/PowerSystems 1.0.0-master/package.mo): time 0.6423/0.6423, allocations: 76.03 MB / 0.5594 GB, free: 14.5 MB / 282.7 MB
Notification: Performance of FrontEnd - loaded program: time 0.0004666/0.0004668, allocations: 16 kB / 0.6216 GB, free: 14.92 MB / 346.7 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.263/0.2635, allocations: 53.21 MB / 0.6736 GB, free: 62.62 MB / 346.7 MB
Notification: Performance of NFInst.instantiate(PowerSystems.Examples.Generic.Network.NetworkLoop_dq0): time 0.005942/0.2695, allocations: 6.764 MB / 0.6802 GB, free: 55.84 MB / 346.7 MB
Notification: Performance of NFInst.instExpressions: time 0.005358/0.2748, allocations: 4.18 MB / 0.6843 GB, free: 51.66 MB / 346.7 MB
Notification: Performance of NFInst.updateImplicitVariability: time 0.0002357/0.2751, allocations: 23.81 kB / 0.6843 GB, free: 51.64 MB / 346.7 MB
Notification: Performance of NFTyping.typeComponents: time 0.0002865/0.2754, allocations: 131.1 kB / 0.6844 GB, free: 51.51 MB / 346.7 MB
Notification: Performance of NFTyping.typeBindings: time 0.001754/0.2772, allocations: 0.9021 MB / 0.6853 GB, free: 50.61 MB / 346.7 MB
Notification: Performance of NFTyping.typeClassSections: time 0.0006129/0.2778, allocations: 259.2 kB / 0.6856 GB, free: 50.35 MB / 346.7 MB
Notification: Performance of NFFlatten.flatten: time 0.001381/0.2792, allocations: 1.901 MB / 0.6874 GB, free: 48.45 MB / 346.7 MB
Notification: Performance of NFFlatten.resolveConnections: time 0.002233/0.2814, allocations: 1.279 MB / 0.6887 GB, free: 47.14 MB / 346.7 MB
Notification: Performance of NFEvalConstants.evaluate: time 0.0005184/0.282, allocations: 497.7 kB / 0.6891 GB, free: 46.66 MB / 346.7 MB
Notification: Performance of NFSimplifyModel.simplify: time 0.0007899/0.2828, allocations: 0.7362 MB / 0.6899 GB, free: 45.92 MB / 346.7 MB
Notification: Performance of NFPackage.collectConstants: time 8.828e-05/0.2829, allocations: 44 kB / 0.6899 GB, free: 45.88 MB / 346.7 MB
Notification: Performance of NFFlatten.collectFunctions: time 0.001558/0.2845, allocations: 0.9193 MB / 0.6908 GB, free: 44.95 MB / 346.7 MB
Notification: Performance of NFScalarize.scalarize: time 0.0004306/0.2849, allocations: 0.5729 MB / 0.6914 GB, free: 44.38 MB / 346.7 MB
Notification: Performance of NFVerifyModel.verify: time 0.000192/0.2851, allocations: 217.2 kB / 0.6916 GB, free: 44.16 MB / 346.7 MB
Notification: Performance of NFConvertDAE.convert: time 0.001276/0.2864, allocations: 1.341 MB / 0.6929 GB, free: 42.82 MB / 346.7 MB
Notification: Performance of FrontEnd - DAE generated: time 3.929e-06/0.2864, allocations: 4 kB / 0.6929 GB, free: 42.81 MB / 346.7 MB
Notification: Performance of FrontEnd: time 2.193e-06/0.2864, allocations: 3.938 kB / 0.6929 GB, free: 42.81 MB / 346.7 MB
Notification: Performance of Transformations before backend: time 1.286e-05/0.2865, allocations: 0 / 0.6929 GB, free: 42.81 MB / 346.7 MB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 267
 * Number of variables: 267
Notification: Performance of Generate backend data structure: time 0.001597/0.2881, allocations: 1.178 MB / 0.694 GB, free: 41.58 MB / 346.7 MB
Notification: Performance of prepare preOptimizeDAE: time 3.303e-05/0.2881, allocations: 8.031 kB / 0.694 GB, free: 41.57 MB / 346.7 MB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.00501/0.2931, allocations: 0.6385 MB / 0.6947 GB, free: 40.93 MB / 346.7 MB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.0008344/0.294, allocations: 0.5393 MB / 0.6952 GB, free: 40.35 MB / 346.7 MB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 5.411e-05/0.2941, allocations: 65.98 kB / 0.6953 GB, free: 40.29 MB / 346.7 MB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.0001713/0.2942, allocations: 91.94 kB / 0.6953 GB, free: 40.2 MB / 346.7 MB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.002372/0.2966, allocations: 1.465 MB / 0.6968 GB, free: 38.7 MB / 346.7 MB
Notification: Performance of preOpt findStateOrder (simulation): time 3.404e-05/0.2967, allocations: 4 kB / 0.6968 GB, free: 38.7 MB / 346.7 MB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0001176/0.2968, allocations: 32 kB / 0.6968 GB, free: 38.66 MB / 346.7 MB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.0001176/0.2969, allocations: 102 kB / 0.6969 GB, free: 38.56 MB / 346.7 MB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.002653/0.2996, allocations: 1.48 MB / 0.6984 GB, free: 37.07 MB / 346.7 MB
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.007788/0.3074, allocations: 4.876 MB / 0.7031 GB, free: 31.99 MB / 346.7 MB
Notification: Performance of preOpt comSubExp (simulation): time 0.001945/0.3094, allocations: 1.167 MB / 0.7043 GB, free: 30.8 MB / 346.7 MB
Notification: Performance of preOpt resolveLoops (simulation): time 0.001152/0.3105, allocations: 0.749 MB / 0.705 GB, free: 30.05 MB / 346.7 MB
Notification: Performance of preOpt evalFunc (simulation): time 7.573e-05/0.3106, allocations: 13.06 kB / 0.705 GB, free: 30.04 MB / 346.7 MB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 2.979e-05/0.3107, allocations: 51.69 kB / 0.705 GB, free: 29.98 MB / 346.7 MB
Notification: Performance of pre-optimization done (n=107): time 3.674e-06/0.3107, allocations: 4 kB / 0.705 GB, free: 29.98 MB / 346.7 MB
Notification: Performance of matching and sorting (n=108): time 0.008404/0.3191, allocations: 3.599 MB / 0.7086 GB, free: 26.33 MB / 346.7 MB
Notification: Performance of inlineWhenForInitialization (initialization): time 3.589e-05/0.3192, allocations: 90.11 kB / 0.7087 GB, free: 26.22 MB / 346.7 MB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.0005215/0.3197, allocations: 469.7 kB / 0.7091 GB, free: 25.75 MB / 346.7 MB
Notification: Performance of collectPreVariables (initialization): time 7.032e-05/0.3198, allocations: 45.73 kB / 0.7091 GB, free: 25.7 MB / 346.7 MB
Notification: Performance of collectInitialEqns (initialization): time 0.0002154/0.32, allocations: 431.4 kB / 0.7096 GB, free: 25.27 MB / 346.7 MB
Notification: Performance of collectInitialBindings (initialization): time 0.0002772/0.3203, allocations: 370.6 kB / 0.7099 GB, free: 24.91 MB / 346.7 MB
Notification: Performance of simplifyInitialFunctions (initialization): time 7.698e-05/0.3204, allocations: 20 kB / 0.7099 GB, free: 24.89 MB / 346.7 MB
Notification: Performance of setup shared object (initialization): time 0.0001093/0.3205, allocations: 382.8 kB / 0.7103 GB, free: 24.5 MB / 346.7 MB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.0009274/0.3214, allocations: 0.5256 MB / 0.7108 GB, free: 23.98 MB / 346.7 MB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.001042/0.3225, allocations: 0.7407 MB / 0.7115 GB, free: 23.16 MB / 346.7 MB
Notification: Performance of analyzeInitialSystem (initialization): time 0.001099/0.3236, allocations: 0.6471 MB / 0.7122 GB, free: 22.52 MB / 346.7 MB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 4.8e-06/0.3236, allocations: 0 / 0.7122 GB, free: 22.52 MB / 346.7 MB
Notification: Performance of matching and sorting (n=139) (initialization): time 0.003389/0.327, allocations: 1.775 MB / 0.7139 GB, free: 20.73 MB / 346.7 MB
Notification: Performance of prepare postOptimizeDAE: time 1.94e-05/0.3271, allocations: 8 kB / 0.7139 GB, free: 20.72 MB / 346.7 MB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 1.096e-05/0.3271, allocations: 4 kB / 0.7139 GB, free: 20.71 MB / 346.7 MB
Notification: Performance of postOpt tearingSystem (initialization): time 0.001306/0.3284, allocations: 410.7 kB / 0.7143 GB, free: 20.31 MB / 346.7 MB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.001061/0.3295, allocations: 239.6 kB / 0.7145 GB, free: 20.07 MB / 346.7 MB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.007443/0.3369, allocations: 5.606 MB / 0.72 GB, free: 14.18 MB / 346.7 MB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.000793/0.3378, allocations: 75.98 kB / 0.7201 GB, free: 14.11 MB / 346.7 MB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0001132/0.3379, allocations: 40 kB / 0.7201 GB, free: 14.07 MB / 346.7 MB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 26
 * Number of states: 0 ()
 * Number of discrete variables: 1 (system.initime)
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (105):
 * Single equations (assignments): 103
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (linear and non-linear blocks): 0
 * Torn equation systems: 2
 * Mixed (continuous/discrete) equation systems: 0
Notification: Torn system details for strict tearing set:
 * Linear torn systems: 2 {(2,100.0%) 26,(1,100.0%) 7}
 * Non-linear torn systems: 0
Notification: Performance of prepare postOptimizeDAE: time 0.000518/0.3384, allocations: 369.3 kB / 0.7205 GB, free: 13.7 MB / 346.7 MB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0001625/0.3386, allocations: 71.16 kB / 0.7205 GB, free: 13.62 MB / 346.7 MB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.003623/0.3422, allocations: 1.779 MB / 0.7223 GB, free: 11.84 MB / 346.7 MB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 1.267e-05/0.3423, allocations: 15.95 kB / 0.7223 GB, free: 11.82 MB / 346.7 MB
Notification: Performance of postOpt constantLinearSystem (simulation): time 9.659e-06/0.3423, allocations: 8 kB / 0.7223 GB, free: 11.81 MB / 346.7 MB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 1.487e-05/0.3423, allocations: 7.969 kB / 0.7223 GB, free: 11.8 MB / 346.7 MB
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 postOpt removeSimpleEquations (simulation): time 0.006682/0.349, allocations: 3.434 MB / 0.7257 GB, free: 8.238 MB / 346.7 MB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 9.156e-06/0.349, allocations: 0 / 0.7257 GB, free: 8.238 MB / 346.7 MB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.001009/0.3501, allocations: 187.8 kB / 0.7258 GB, free: 8.055 MB / 346.7 MB
Notification: Performance of postOpt tearingSystem (simulation): time 0.001268/0.3513, allocations: 353.8 kB / 0.7262 GB, free: 7.703 MB / 346.7 MB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 8.694e-05/0.3514, allocations: 24 kB / 0.7262 GB, free: 7.68 MB / 346.7 MB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 0.007103/0.3586, allocations: 5.34 MB / 0.7314 GB, free: 2.055 MB / 346.7 MB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 5.801e-06/0.3586, allocations: 7.938 kB / 0.7314 GB, free: 2.047 MB / 346.7 MB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.003245/0.3619, allocations: 1.792 MB / 0.7332 GB, free: 192 kB / 346.7 MB
Notification: Performance of postOpt removeConstants (simulation): time 0.0001799/0.3621, allocations: 156.1 kB / 0.7333 GB, free: 16 kB / 346.7 MB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.0001847/0.3623, allocations: 40.02 kB / 0.7333 GB, free: 15.97 MB / 362.7 MB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.0006528/0.3629, allocations: 47.95 kB / 0.7334 GB, free: 15.93 MB / 362.7 MB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.000207/0.3631, allocations: 84.81 kB / 0.7335 GB, free: 15.84 MB / 362.7 MB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 0.0001021/0.3633, allocations: 36 kB / 0.7335 GB, free: 15.8 MB / 362.7 MB
Notification: Performance of sorting global known variables: time 0.0004851/0.3638, allocations: 327 kB / 0.7338 GB, free: 15.49 MB / 362.7 MB
Notification: Performance of sort global known variables: time 8.07e-07/0.3638, allocations: 4 kB / 0.7338 GB, free: 15.48 MB / 362.7 MB
Notification: Performance of remove unused functions: time 0.001417/0.3652, allocations: 396 kB / 0.7342 GB, free: 15.1 MB / 362.7 MB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 16
 * Number of states: 0 ()
 * Number of discrete variables: 1 (system.initime)
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for simulation (91):
 * Single equations (assignments): 88
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 1
 * If-equations: 0
 * Equation systems (linear and non-linear blocks): 0
 * Torn equation systems: 2
 * Mixed (continuous/discrete) equation systems: 0
Notification: Torn system details for strict tearing set:
 * Linear torn systems: 2 {(1,100.0%) 7,(2,100.0%) 24}
 * Non-linear torn systems: 0
Notification: Performance of Backend phase and start with SimCode phase: time 0.0002156/0.3654, allocations: 131.1 kB / 0.7343 GB, free: 14.96 MB / 362.7 MB
Notification: Performance of simCode: created initialization part: time 0.003377/0.3688, allocations: 1.709 MB / 0.736 GB, free: 13.23 MB / 362.7 MB
Notification: Performance of simCode: created event and clocks part: time 3.999e-06/0.3688, allocations: 0 / 0.736 GB, free: 13.23 MB / 362.7 MB
Notification: Performance of simCode: created simulation system equations: time 0.002029/0.3709, allocations: 1.065 MB / 0.737 GB, free: 12.14 MB / 362.7 MB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.0009307/0.3718, allocations: 122.9 kB / 0.7372 GB, free: 12.02 MB / 362.7 MB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.004626/0.3765, allocations: 2.582 MB / 0.7397 GB, free: 9.367 MB / 362.7 MB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.001229/0.3777, allocations: 1.19 MB / 0.7408 GB, free: 8.148 MB / 362.7 MB
Notification: Performance of simCode: alias equations: time 0.0008407/0.3786, allocations: 233.4 kB / 0.7411 GB, free: 7.918 MB / 362.7 MB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.0002938/0.3789, allocations: 67.36 kB / 0.7411 GB, free: 7.852 MB / 362.7 MB
Notification: Performance of SimCode: time 1.431e-06/0.3789, allocations: 0 / 0.7411 GB, free: 7.852 MB / 362.7 MB
Notification: Performance of Templates: time 0.02649/0.4054, allocations: 11.04 MB / 0.7519 GB, free: 12.86 MB / 378.7 MB