Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr ModelicaTest_4.1.0-beta.om_ModelicaTest.MultiBody.Joints.JointSSP.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices trunk/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex trunk/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica trunk/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest 4.1.0-beta.om/package.mo", uses=false)
Using package ModelicaTest with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest 4.1.0-beta.om/package.mo)
Using package Modelica with version trunk (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica trunk/package.mo)
Using package Complex with version trunk (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex trunk/package.mo)
Using package ModelicaServices with version trunk (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices trunk/package.mo)
Running command: "" <> buildModelFMU(ModelicaTest.MultiBody.Joints.JointSSP,fileNamePrefix="ModelicaTest_4_1_0-beta_om_ModelicaTest_MultiBody_Joints_JointSSP",fmuType="me",version="2.0",platforms={"static"})
"" <> buildModelFMU(ModelicaTest.MultiBody.Joints.JointSSP,fileNamePrefix="ModelicaTest_4_1_0-beta_om_ModelicaTest_MultiBody_Joints_JointSSP",fmuType="me",version="2.0",platforms={"static"})
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices trunk/package.mo): time 0.00127/0.00127, allocations: 117.2 kB / 17.79 MB, free: 5.273 MB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex trunk/package.mo): time 0.001307/0.001307, allocations: 199.8 kB / 18.74 MB, free: 4.332 MB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica trunk/package.mo): time 1.441/1.441, allocations: 227.4 MB / 247 MB, free: 10.45 MB / 206.1 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest 4.1.0-beta.om/package.mo): time 0.2297/0.2297, allocations: 46.12 MB / 344.4 MB, free: 11.47 MB / 286.1 MB
Warning: Requested package Modelica of version 4.1.0, but this package was already loaded with version trunk. OpenModelica cannot reason about compatibility between the two packages since they are not semantic versions.
Notification: Performance of FrontEnd - loaded program: time 0.002288/0.002288, allocations: 75.88 kB / 480.9 MB, free: 4.527 MB / 350.1 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.3822/0.3845, allocations: 62.45 MB / 0.5306 GB, free: 13.39 MB / 398.1 MB
Notification: Performance of NFInst.instantiate(ModelicaTest.MultiBody.Joints.JointSSP): time 0.01183/0.3964, allocations: 9.581 MB / 0.54 GB, free: 5.883 MB / 398.1 MB
Notification: Performance of NFInst.instExpressions: time 0.007286/0.4037, allocations: 3.207 MB / 0.5431 GB, free: 3.363 MB / 398.1 MB
Notification: Performance of NFInst.updateImplicitVariability: time 0.001665/0.4054, allocations: 46.91 kB / 0.5431 GB, free: 3.359 MB / 398.1 MB
Notification: Performance of NFTyping.typeComponents: time 0.005017/0.4105, allocations: 2.645 MB / 0.5457 GB, free: 1.598 MB / 398.1 MB
Notification: Performance of NFTyping.typeBindings: time 0.002088/0.4126, allocations: 0.6019 MB / 0.5463 GB, free: 1.113 MB / 398.1 MB
Notification: Performance of NFTyping.typeClassSections: time 0.001472/0.4141, allocations: 0.5242 MB / 0.5468 GB, free: 0.7344 MB / 398.1 MB
Notification: Performance of NFFlatten.flatten: time 0.002303/0.4164, allocations: 1.478 MB / 0.5483 GB, free: 15.6 MB / 414.1 MB
Notification: Performance of NFFlatten.resolveConnections: time 0.003564/0.42, allocations: 3.225 MB / 0.5514 GB, free: 12.32 MB / 414.1 MB
Notification: Performance of NFEvalConstants.evaluate: time 0.001425/0.4214, allocations: 0.9581 MB / 0.5524 GB, free: 11.36 MB / 414.1 MB
Notification: Performance of NFSimplifyModel.simplify: time 0.001676/0.4231, allocations: 1.262 MB / 0.5536 GB, free: 10.09 MB / 414.1 MB
Notification: Performance of NFPackage.collectConstants: time 0.0004002/0.4235, allocations: 268 kB / 0.5538 GB, free: 9.832 MB / 414.1 MB
Notification: Performance of NFFlatten.collectFunctions: time 0.001488/0.425, allocations: 0.8114 MB / 0.5546 GB, free: 9.02 MB / 414.1 MB
Notification: Performance of NFScalarize.scalarize: time 0.001117/0.4262, allocations: 1.146 MB / 0.5558 GB, free: 7.871 MB / 414.1 MB
Notification: Performance of NFVerifyModel.verify: time 0.001355/0.4275, allocations: 1.348 MB / 0.5571 GB, free: 6.516 MB / 414.1 MB
Notification: Performance of NFConvertDAE.convert: time 0.005108/0.4326, allocations: 4.437 MB / 0.5614 GB, free: 2.062 MB / 414.1 MB
Notification: Performance of FrontEnd - DAE generated: time 5.37e-06/0.4327, allocations: 0 / 0.5614 GB, free: 2.062 MB / 414.1 MB
Notification: Performance of FrontEnd: time 4.719e-06/0.4327, allocations: 4 kB / 0.5614 GB, free: 2.059 MB / 414.1 MB
Notification: Performance of Transformations before backend: time 8.588e-05/0.4328, allocations: 3.938 kB / 0.5614 GB, free: 2.055 MB / 414.1 MB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 811
 * Number of variables: 811
Notification: Performance of Generate backend data structure: time 0.005349/0.4381, allocations: 2.851 MB / 0.5642 GB, free: 15.14 MB / 430.1 MB
Notification: Performance of prepare preOptimizeDAE: time 4.979e-05/0.4382, allocations: 8.031 kB / 0.5642 GB, free: 15.13 MB / 430.1 MB
Notification: Performance of preOpt introduceOutputAliases (simulation): time 0.0005072/0.4387, allocations: 418.9 kB / 0.5646 GB, free: 14.71 MB / 430.1 MB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.001138/0.4399, allocations: 366.8 kB / 0.5649 GB, free: 14.35 MB / 430.1 MB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.002067/0.4419, allocations: 1.248 MB / 0.5662 GB, free: 13.05 MB / 430.1 MB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.0001366/0.4421, allocations: 168.3 kB / 0.5663 GB, free: 12.88 MB / 430.1 MB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.0003513/0.4425, allocations: 223.9 kB / 0.5665 GB, free: 12.66 MB / 430.1 MB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.01085/0.4533, allocations: 5.615 MB / 0.572 GB, free: 6.77 MB / 430.1 MB
Notification: Performance of preOpt findStateOrder (simulation): time 6.225e-05/0.4534, allocations: 19.88 kB / 0.572 GB, free: 6.75 MB / 430.1 MB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0002241/0.4536, allocations: 95.95 kB / 0.5721 GB, free: 6.656 MB / 430.1 MB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 0.001128/0.4548, allocations: 0.7734 MB / 0.5729 GB, free: 5.879 MB / 430.1 MB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.01004/0.4648, allocations: 4.297 MB / 0.5771 GB, free: 1.582 MB / 430.1 MB
Notification: Performance of preOpt removeSimpleEquations (simulation): time 0.02178/0.4867, allocations: 17.08 MB / 0.5938 GB, free: 44 kB / 446.1 MB
Notification: Performance of preOpt comSubExp (simulation): time 0.00415/0.4908, allocations: 1.247 MB / 0.595 GB, free: 14.79 MB / 462.1 MB
Notification: Performance of preOpt resolveLoops (simulation): time 0.0006418/0.4915, allocations: 398.3 kB / 0.5954 GB, free: 14.39 MB / 462.1 MB
Notification: Performance of preOpt evalFunc (simulation): time 0.001973/0.4935, allocations: 2.141 MB / 0.5975 GB, free: 11.9 MB / 462.1 MB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 4.202e-05/0.4936, allocations: 47 kB / 0.5975 GB, free: 11.85 MB / 462.1 MB
Notification: Performance of pre-optimization done (n=65): time 5.079e-06/0.4936, allocations: 3.984 kB / 0.5975 GB, free: 11.84 MB / 462.1 MB
Notification: Performance of matching and sorting (n=109): time 0.02067/0.5142, allocations: 5.401 MB / 0.6028 GB, free: 6.434 MB / 462.1 MB
Notification: Performance of inlineWhenForInitialization (initialization): time 5.732e-05/0.5143, allocations: 64.41 kB / 0.6028 GB, free: 6.359 MB / 462.1 MB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.002422/0.5168, allocations: 1.725 MB / 0.6045 GB, free: 4.625 MB / 462.1 MB
Notification: Performance of collectPreVariables (initialization): time 7.07e-05/0.5169, allocations: 45.7 kB / 0.6046 GB, free: 4.574 MB / 462.1 MB
Notification: Performance of collectInitialEqns (initialization): time 0.001179/0.518, allocations: 1.55 MB / 0.6061 GB, free: 3.008 MB / 462.1 MB
Notification: Performance of collectInitialBindings (initialization): time 0.0003627/0.5184, allocations: 424.6 kB / 0.6065 GB, free: 2.59 MB / 462.1 MB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.0007039/0.5191, allocations: 0.5247 MB / 0.607 GB, free: 2.059 MB / 462.1 MB
Notification: Performance of setup shared object (initialization): time 0.0001419/0.5193, allocations: 305.1 kB / 0.6073 GB, free: 1.758 MB / 462.1 MB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.001245/0.5205, allocations: 0.7743 MB / 0.608 GB, free: 0.9805 MB / 462.1 MB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.002432/0.523, allocations: 2.231 MB / 0.6102 GB, free: 14.04 MB / 478.1 MB
Notification: Performance of analyzeInitialSystem (initialization): time 0.004097/0.5271, allocations: 3.279 MB / 0.6134 GB, free: 10.05 MB / 478.1 MB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 2.305e-05/0.5271, allocations: 12 kB / 0.6134 GB, free: 10.04 MB / 478.1 MB
Notification: Performance of matching and sorting (n=340) (initialization): time 0.004753/0.5319, allocations: 3.02 MB / 0.6164 GB, free: 7.012 MB / 478.1 MB
Notification: Performance of prepare postOptimizeDAE: time 3.843e-05/0.5319, allocations: 24 kB / 0.6164 GB, free: 6.988 MB / 478.1 MB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 5.376e-05/0.532, allocations: 52 kB / 0.6165 GB, free: 6.938 MB / 478.1 MB
Notification: Performance of postOpt tearingSystem (initialization): time 7.759e-05/0.5321, allocations: 68.78 kB / 0.6165 GB, free: 6.871 MB / 478.1 MB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.001806/0.5339, allocations: 0.6004 MB / 0.6171 GB, free: 6.27 MB / 478.1 MB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 9.31e-05/0.534, allocations: 99.64 kB / 0.6172 GB, free: 6.172 MB / 478.1 MB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.001318/0.5353, allocations: 115.9 kB / 0.6173 GB, free: 6.059 MB / 478.1 MB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0001783/0.5355, allocations: 147.9 kB / 0.6175 GB, free: 5.914 MB / 478.1 MB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 230
 * Number of states: 0 ()
 * Number of discrete variables: 38 (prism.arrowLine.twoHeadedArrow,prism.headAtOrigin,rRod2.arrowLine.twoHeadedArrow,rRod2.headAtOrigin,jointSSP.prismatic.positiveBranch,prism.color[3],prism.color[2],prism.color[1],rRod2.color[3],rRod2.color[2],rRod2.color[1],jointSSP.rod1Color[3],jointSSP.rod1Color[2],jointSSP.rod1Color[1],jointSSP.rod1.massColor[3],jointSSP.rod1.massColor[2],jointSSP.rod1.massColor[1],jointSSP.sphereColor[3],jointSSP.sphereColor[2],jointSSP.sphereColor[1],jointSSP.boxColor[3],jointSSP.boxColor[2],jointSSP.boxColor[1],Fixed1.color[3],Fixed1.color[2],Fixed1.color[1],world.groundColor[3],world.groundColor[2],world.groundColor[1],world.gravitySphereColor[3],world.gravitySphereColor[2],world.gravitySphereColor[1],world.gravityArrowColor[3],world.gravityArrowColor[2],world.gravityArrowColor[1],world.axisColor_x[3],world.axisColor_x[2],world.axisColor_x[1])
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (340):
 * Single equations (assignments): 340
 * 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 prepare postOptimizeDAE: time 0.001639/0.5371, allocations: 1.14 MB / 0.6186 GB, free: 4.766 MB / 478.1 MB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0002396/0.5374, allocations: 174.9 kB / 0.6187 GB, free: 4.594 MB / 478.1 MB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.0003986/0.5378, allocations: 204.8 kB / 0.6189 GB, free: 4.387 MB / 478.1 MB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 1.106e-05/0.5378, allocations: 12 kB / 0.6189 GB, free: 4.375 MB / 478.1 MB
Notification: Performance of postOpt constantLinearSystem (simulation): time 9.197e-06/0.5378, allocations: 0 / 0.6189 GB, free: 4.375 MB / 478.1 MB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 1.089e-05/0.5378, allocations: 7.969 kB / 0.619 GB, free: 4.367 MB / 478.1 MB
Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.008658/0.5465, allocations: 6.066 MB / 0.6249 GB, free: 13.94 MB / 494.1 MB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 2.85e-05/0.5466, allocations: 20 kB / 0.6249 GB, free: 13.92 MB / 494.1 MB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.0006709/0.5473, allocations: 207.6 kB / 0.6251 GB, free: 13.72 MB / 494.1 MB
Notification: Performance of postOpt tearingSystem (simulation): time 2.9e-05/0.5473, allocations: 28 kB / 0.6251 GB, free: 13.69 MB / 494.1 MB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 6.51e-05/0.5474, allocations: 40 kB / 0.6252 GB, free: 13.65 MB / 494.1 MB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 3.495e-05/0.5474, allocations: 43.8 kB / 0.6252 GB, free: 13.61 MB / 494.1 MB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 2.934e-05/0.5474, allocations: 31.81 kB / 0.6252 GB, free: 13.58 MB / 494.1 MB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.002129/0.5496, allocations: 1.691 MB / 0.6269 GB, free: 11.6 MB / 494.1 MB
Notification: Performance of postOpt removeConstants (simulation): time 0.0004216/0.55, allocations: 267.9 kB / 0.6271 GB, free: 11.32 MB / 494.1 MB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.0001715/0.5502, allocations: 47.92 kB / 0.6272 GB, free: 11.27 MB / 494.1 MB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.0006212/0.5508, allocations: 39.98 kB / 0.6272 GB, free: 11.23 MB / 494.1 MB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.0001618/0.551, allocations: 139.3 kB / 0.6274 GB, free: 11.09 MB / 494.1 MB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 6.645e-05/0.5511, allocations: 52 kB / 0.6274 GB, free: 11.04 MB / 494.1 MB
Notification: Performance of sorting global known variables: time 0.001623/0.5527, allocations: 1.139 MB / 0.6285 GB, free: 9.91 MB / 494.1 MB
Notification: Performance of sort global known variables: time 1.61e-07/0.5527, allocations: 0 / 0.6285 GB, free: 9.91 MB / 494.1 MB
Notification: Performance of remove unused functions: time 0.002171/0.5549, allocations: 467.9 kB / 0.629 GB, free: 9.453 MB / 494.1 MB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 90
 * 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 simulation (109):
 * Single equations (assignments): 109
 * 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.002616/0.5575, allocations: 2.31 MB / 0.6312 GB, free: 6.848 MB / 494.1 MB
Notification: Performance of simCode: created initialization part: time 0.003049/0.5606, allocations: 1.827 MB / 0.633 GB, free: 5.031 MB / 494.1 MB
Notification: Performance of simCode: created event and clocks part: time 1.03e-05/0.5606, allocations: 5.875 kB / 0.633 GB, free: 5.027 MB / 494.1 MB
Notification: Performance of simCode: created simulation system equations: time 0.0007542/0.5613, allocations: 499.9 kB / 0.6335 GB, free: 4.543 MB / 494.1 MB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.001652/0.563, allocations: 274.1 kB / 0.6337 GB, free: 4.273 MB / 494.1 MB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.03053/0.5935, allocations: 19.78 MB / 0.6531 GB, free: 14.05 MB / 0.5137 GB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.002445/0.596, allocations: 2.089 MB / 0.6551 GB, free: 11.92 MB / 0.5137 GB
Notification: Performance of simCode: alias equations: time 0.00178/0.5978, allocations: 0.6673 MB / 0.6558 GB, free: 11.25 MB / 0.5137 GB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.001266/0.5991, allocations: 0.9562 MB / 0.6567 GB, free: 10.29 MB / 0.5137 GB
Notification: Performance of SimCode: time 1.473e-06/0.5991, allocations: 0 / 0.6567 GB, free: 10.29 MB / 0.5137 GB
Notification: Performance of buildModelFMU: Generate the FMI files: time 0.07231/0.6714, allocations: 34.94 MB / 0.6908 GB, free: 7.539 MB / 0.545 GB
Notification: Performance of buildModelFMU: Generate platform static: time 11.75/12.43, allocations: 31.72 kB / 0.6908 GB, free: 7.512 MB / 0.545 GB
(rm -f ModelicaTest_4.1.0-beta.om_ModelicaTest.MultiBody.Joints.JointSSP.pipe ; mkfifo ModelicaTest_4.1.0-beta.om_ModelicaTest.MultiBody.Joints.JointSSP.pipe ; head -c 1048576 < ModelicaTest_4.1.0-beta.om_ModelicaTest.MultiBody.Joints.JointSSP.pipe >> ../files/ModelicaTest_4.1.0-beta.om_ModelicaTest.MultiBody.Joints.JointSSP.sim & python3 -m fmpy simulate  --output-file ModelicaTest_4.1.0-beta.om_ModelicaTest.MultiBody.Joints.JointSSP_res.csv --start-time 0 --stop-time 1.1 --timeout 50 --relative-tolerance 1e-06 --interface-type ModelExchange --solver CVode --output-interval 0.00044 ModelicaTest_4_1_0-beta_om_ModelicaTest_MultiBody_Joints_JointSSP.fmu > ModelicaTest_4.1.0-beta.om_ModelicaTest.MultiBody.Joints.JointSSP.pipe 2>&1)