Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr PowerSystems_PowerSystems.Examples.AC3ph.Elementary.Fault.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.001456/0.001456, allocations: 103.6 kB / 21.25 MB, free: 0.5664 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.001728/0.001728, allocations: 212.5 kB / 24.55 MB, free: 3.824 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.52/1.52, allocations: 230.7 MB / 258.3 MB, free: 7.762 MB / 206.1 MB " [Timeout remaining time 178] loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/PowerSystems 2.0.0/package.mo", uses=false) [Timeout 180] "Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/PowerSystems 2.0.0/package.mo): time 0.1763/0.1763, allocations: 38.55 MB / 353.3 MB, free: 12.27 MB / 286.1 MB " [Timeout remaining time 180] Using package PowerSystems with version 2.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/PowerSystems 2.0.0/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(PowerSystems.Examples.AC3ph.Elementary.Fault,tolerance=1e-06,outputFormat="empty",numberOfIntervals=2000,variableFilter="",fileNamePrefix="PowerSystems_PowerSystems.Examples.AC3ph.Elementary.Fault") translateModel(PowerSystems.Examples.AC3ph.Elementary.Fault,tolerance=1e-06,outputFormat="empty",numberOfIntervals=2000,variableFilter="",fileNamePrefix="PowerSystems_PowerSystems.Examples.AC3ph.Elementary.Fault") [Timeout 660] "Notification: Performance of FrontEnd - Absyn->SCode: time 2.851e-05/2.851e-05, allocations: 2.281 kB / 493.8 MB, free: 4.184 MB / 350.1 MB Notification: Performance of NFInst.instantiate(PowerSystems.Examples.AC3ph.Elementary.Fault): time 0.01074/0.01077, allocations: 6.999 MB / 0.4891 GB, free: 13.15 MB / 366.1 MB Notification: Performance of NFInst.instExpressions: time 0.005176/0.01594, allocations: 2.22 MB / 0.4912 GB, free: 10.92 MB / 366.1 MB Notification: Performance of NFInst.updateImplicitVariability: time 0.0007526/0.01669, allocations: 31.75 kB / 0.4913 GB, free: 10.89 MB / 366.1 MB Notification: Performance of NFTyping.typeComponents: time 0.002297/0.01899, allocations: 0.7453 MB / 0.492 GB, free: 10.14 MB / 366.1 MB Notification: Performance of NFTyping.typeBindings: time 0.002012/0.021, allocations: 0.6338 MB / 0.4926 GB, free: 9.508 MB / 366.1 MB Notification: Performance of NFTyping.typeClassSections: time 0.001275/0.02228, allocations: 487.1 kB / 0.4931 GB, free: 9.031 MB / 366.1 MB Notification: Performance of NFFlatten.flatten: time 0.002457/0.02474, allocations: 1.72 MB / 0.4948 GB, free: 7.309 MB / 366.1 MB Notification: Performance of NFFlatten.resolveConnections: time 0.0007576/0.02549, allocations: 417.1 kB / 0.4952 GB, free: 6.898 MB / 366.1 MB Notification: Performance of NFEvalConstants.evaluate: time 0.001282/0.02678, allocations: 0.7162 MB / 0.4959 GB, free: 6.18 MB / 366.1 MB Notification: Performance of NFSimplifyModel.simplify: time 0.0008448/0.02762, allocations: 0.5446 MB / 0.4964 GB, free: 5.633 MB / 366.1 MB Notification: Performance of NFPackage.collectConstants: time 0.0001269/0.02775, allocations: 76 kB / 0.4965 GB, free: 5.559 MB / 366.1 MB Notification: Performance of NFFlatten.collectFunctions: time 0.0009746/0.02872, allocations: 0.5031 MB / 0.497 GB, free: 5.055 MB / 366.1 MB Notification: Performance of combineBinaries: time 0.001604/0.03033, allocations: 1.723 MB / 0.4986 GB, free: 3.316 MB / 366.1 MB Notification: Performance of replaceArrayConstructors: time 0.000951/0.03128, allocations: 1.058 MB / 0.4997 GB, free: 2.246 MB / 366.1 MB Notification: Performance of NFVerifyModel.verify: time 0.000166/0.03144, allocations: 64 kB / 0.4997 GB, free: 2.184 MB / 366.1 MB Notification: Performance of FrontEnd: time 0.0001396/0.03158, allocations: 23.88 kB / 0.4998 GB, free: 2.16 MB / 366.1 MB Notification: Model statistics after passing the front-end and creating the data structures used by the back-end: * Number of equations: 292 (145) * Number of variables: 292 (148) Notification: Performance of [SIM] Bindings: time 0.004705/0.03629, allocations: 4.045 MB / 0.5037 GB, free: 13.93 MB / 382.1 MB Notification: Performance of [SIM] FunctionAlias: time 0.0007079/0.037, allocations: 0.5227 MB / 0.5042 GB, free: 13.38 MB / 382.1 MB Notification: Performance of [SIM] Early Inline: time 0.002896/0.03989, allocations: 2.65 MB / 0.5068 GB, free: 10.69 MB / 382.1 MB Notification: Performance of [SIM] Simplify 1: time 0.0006598/0.04055, allocations: 416.7 kB / 0.5072 GB, free: 10.21 MB / 382.1 MB Warning: NBAlias.setStartFixed: Multiple variables are fixed and have identical start values. Use -d=dumprepl for more information. Notification: Performance of [SIM] Alias: time 0.00487/0.04542, allocations: 3.38 MB / 0.5105 GB, free: 6.477 MB / 382.1 MB Notification: Performance of [SIM] Simplify 2: time 0.0005912/0.04601, allocations: 336.6 kB / 0.5108 GB, free: 6.098 MB / 382.1 MB Notification: Performance of [SIM] Remove Stream: time 0.0002973/0.04631, allocations: 240 kB / 0.5111 GB, free: 5.836 MB / 382.1 MB Notification: Performance of [SIM] Detect States: time 0.0008278/0.04714, allocations: 0.6163 MB / 0.5117 GB, free: 5.176 MB / 382.1 MB Notification: Performance of [SIM] Events: time 0.0005125/0.04765, allocations: 359.7 kB / 0.512 GB, free: 4.793 MB / 382.1 MB Notification: Performance of [SIM] Partitioning: time 0.001228/0.04888, allocations: 1.005 MB / 0.513 GB, free: 3.734 MB / 382.1 MB Notification: Performance of [SIM] Causalize: time 0.2528/0.3016, allocations: 5.538 MB / 0.5184 GB, free: 28.89 MB / 382.1 MB Notification: Performance of [SIM] After Index Reduction Inline: time 0.002288/0.3039, allocations: 2.007 MB / 0.5203 GB, free: 28.89 MB / 382.1 MB Notification: Performance of [INI] Simplify: time 0.002109/0.306, allocations: 1.102 MB / 0.5214 GB, free: 28.61 MB / 382.1 MB Notification: Performance of [INI] Inline: time 0.003517/0.3096, allocations: 3.339 MB / 0.5247 GB, free: 28.59 MB / 382.1 MB Notification: Performance of [INI] Partitioning: time 0.000128/0.3097, allocations: 61.33 kB / 0.5247 GB, free: 28.55 MB / 382.1 MB Notification: Performance of [INI] Cleanup: time 0.0005265/0.3102, allocations: 495.3 kB / 0.5252 GB, free: 28.41 MB / 382.1 MB Notification: Performance of [INI] Causalize: time 0.009864/0.3201, allocations: 6.913 MB / 0.532 GB, free: 27.08 MB / 382.1 MB Notification: Performance of [INI] Tearing: time 0.0004142/0.3205, allocations: 363.3 kB / 0.5323 GB, free: 27 MB / 382.1 MB Notification: Performance of [SIM] Initialization: time 2.475e-06/0.3205, allocations: 3.25 kB / 0.5323 GB, free: 27 MB / 382.1 MB Notification: Performance of [SIM] DAE-Mode: time 0.0007465/0.3212, allocations: 418.7 kB / 0.5327 GB, free: 26.85 MB / 382.1 MB Notification: Performance of [SIM] Remove Dummies: time 9.909e-06/0.3212, allocations: 3.969 kB / 0.5327 GB, free: 26.85 MB / 382.1 MB Notification: Performance of [SIM] Tearing: time 8.818e-05/0.3213, allocations: 155.3 kB / 0.5329 GB, free: 26.75 MB / 382.1 MB Notification: Performance of [SIM] Categorize: time 2.808e-05/0.3214, allocations: 10.03 kB / 0.5329 GB, free: 26.75 MB / 382.1 MB Notification: Performance of [SIM] Solve: time 0.003278/0.3246, allocations: 2.87 MB / 0.5357 GB, free: 25.75 MB / 382.1 MB Error: Internal error NBJacobian.SparsityColoring.PartialD2ColoringAlgC.getIndices failed because cref voltage2.vPhasor_internal[1] is neither a seed nor a partial candidate! " [Timeout remaining time 660] [Calling sys.exit(0), Time elapsed: 3.0471993620158173] Failed to read output from testmodel.py, exit status != 0: 0.3334212959744036 0.342007316 0.308154162 Calling exit ...