Execution Chart

We display below the execution chart for this examination (boot time has been removed).

Trace from the execution

Formatting '/mnt/tpsp/fkordon/mcc2020-input.r176-tajo-158987872000538.qcow2', fmt=qcow2 size=4294967296 backing_file='/mnt/tpsp/fkordon/mcc2020-input.qcow2' encryption=off cluster_size=65536 lazy_refcounts=off
Waiting for the VM to be ready (probing ssh)
............................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................
=====================================================================
Generated by BenchKit 2-4028
Executing tool itslola
Input is PolyORBLF-PT-S06J06T06, examination is LTLFireability
Time confinement is 3600 seconds
Memory confinement is 16384 MBytes
Number of cores is 4
Run identifier is r176-tajo-158987872000538
=====================================================================

--------------------
preparation of the directory to be used:
/home/mcc/execution
total 16M
-rw-r--r-- 1 mcc users 8.8K Apr 12 05:56 CTLCardinality.txt
-rw-r--r-- 1 mcc users 27K Apr 12 05:56 CTLCardinality.xml
-rw-r--r-- 1 mcc users 33K Apr 11 05:36 CTLFireability.txt
-rw-r--r-- 1 mcc users 119K Apr 11 05:36 CTLFireability.xml
-rw-r--r-- 1 mcc users 4.0K Mar 24 05:37 GenericPropertiesDefinition.xml
-rw-r--r-- 1 mcc users 5.9K Mar 24 05:37 GenericPropertiesVerdict.xml
-rw-r--r-- 1 mcc users 11K Apr 14 12:46 LTLCardinality.txt
-rw-r--r-- 1 mcc users 45K Apr 28 14:02 LTLCardinality.xml
-rw-r--r-- 1 mcc users 11K Apr 14 12:46 LTLFireability.txt
-rw-r--r-- 1 mcc users 42K Apr 28 14:02 LTLFireability.xml
-rw-r--r-- 1 mcc users 11K Apr 10 12:52 ReachabilityCardinality.txt
-rw-r--r-- 1 mcc users 34K Apr 10 12:52 ReachabilityCardinality.xml
-rw-r--r-- 1 mcc users 214K Apr 9 18:27 ReachabilityFireability.txt
-rw-r--r-- 1 mcc users 685K Apr 9 18:27 ReachabilityFireability.xml
-rw-r--r-- 1 mcc users 2.2K Apr 10 22:23 UpperBounds.txt
-rw-r--r-- 1 mcc users 4.7K Apr 10 22:23 UpperBounds.xml
-rw-r--r-- 1 mcc users 5 Mar 24 05:37 equiv_col
-rw-r--r-- 1 mcc users 10 Mar 24 05:37 instance
-rw-r--r-- 1 mcc users 6 Mar 24 05:37 iscolored
-rw-r--r-- 1 mcc users 15M Mar 24 05:37 model.pnml

--------------------
content from stdout:

=== Data for post analysis generated by BenchKit (invocation template)

The expected result is a vector of booleans
BOOL_VECTOR

here is the order used to build the result vector(from text file)
FORMULA_NAME PolyORBLF-PT-S06J06T06-00
FORMULA_NAME PolyORBLF-PT-S06J06T06-01
FORMULA_NAME PolyORBLF-PT-S06J06T06-02
FORMULA_NAME PolyORBLF-PT-S06J06T06-03
FORMULA_NAME PolyORBLF-PT-S06J06T06-04
FORMULA_NAME PolyORBLF-PT-S06J06T06-05
FORMULA_NAME PolyORBLF-PT-S06J06T06-06
FORMULA_NAME PolyORBLF-PT-S06J06T06-07
FORMULA_NAME PolyORBLF-PT-S06J06T06-08
FORMULA_NAME PolyORBLF-PT-S06J06T06-09
FORMULA_NAME PolyORBLF-PT-S06J06T06-10
FORMULA_NAME PolyORBLF-PT-S06J06T06-11
FORMULA_NAME PolyORBLF-PT-S06J06T06-12
FORMULA_NAME PolyORBLF-PT-S06J06T06-13
FORMULA_NAME PolyORBLF-PT-S06J06T06-14
FORMULA_NAME PolyORBLF-PT-S06J06T06-15

=== Now, execution of the tool begins

BK_START 1591161653372

bash -c /home/mcc/BenchKit/BenchKit_head.sh 2> STDERR ; echo ; echo -n "BK_STOP " ; date -u +%s%3N
[2020-06-03 05:20:54] [INFO ] Running its-tools with arguments : [-pnfolder, /home/mcc/execution, -examination, LTLFireability, -z3path, /home/mcc/BenchKit//z3/bin/z3, -yices2path, /home/mcc/BenchKit//yices/bin/yices, -timeout, 3600, -rebuildPNML]
[2020-06-03 05:20:54] [INFO ] Parsing pnml file : /home/mcc/execution/model.pnml
[2020-06-03 05:20:55] [INFO ] Load time of PNML (sax parser for PT used): 545 ms
[2020-06-03 05:20:55] [INFO ] Transformed 700 places.
[2020-06-03 05:20:55] [INFO ] Transformed 10740 transitions.
[2020-06-03 05:20:55] [INFO ] Parsed PT model containing 700 places and 10740 transitions in 706 ms.
Ensure Unique test removed 8070 transitions
Reduce redundant transitions removed 8070 transitions.
Parsed 16 properties from file /home/mcc/execution/LTLFireability.xml in 156 ms.
Working with output stream class java.io.PrintStream
Incomplete random walk after 100000 steps, including 607 resets, run finished after 841 ms. (steps per millisecond=118 ) properties seen :[1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 0, 1, 1, 0, 0, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 1, 0, 1]
[2020-06-03 05:20:56] [INFO ] Flow matrix only has 2634 transitions (discarded 36 similar events)
// Phase 1: matrix 2634 rows 700 cols
[2020-06-03 05:20:56] [INFO ] Computed 58 place invariants in 145 ms
[2020-06-03 05:20:57] [INFO ] [Real]Absence check using 22 positive place invariants in 46 ms returned sat
[2020-06-03 05:20:57] [INFO ] [Real]Absence check using 22 positive and 36 generalized place invariants in 64 ms returned sat
[2020-06-03 05:20:57] [INFO ] [Real]Adding state equation constraints to refine reachable states.
[2020-06-03 05:21:02] [INFO ] [Real]Absence check using state equation in 5000 ms returned sat
[2020-06-03 05:21:02] [INFO ] Solution in real domain found non-integer solution.
[2020-06-03 05:21:02] [INFO ] [Nat]Absence check using 22 positive place invariants in 29 ms returned sat
[2020-06-03 05:21:02] [INFO ] [Nat]Absence check using 22 positive and 36 generalized place invariants in 54 ms returned sat
[2020-06-03 05:21:02] [INFO ] [Nat]Adding state equation constraints to refine reachable states.
[2020-06-03 05:21:16] [INFO ] [Nat]Absence check using state equation in 13751 ms returned sat
[2020-06-03 05:21:16] [INFO ] State equation strengthened by 174 read => feed constraints.
[2020-06-03 05:21:17] [INFO ] [Nat]Added 174 Read/Feed constraints in 1686 ms returned sat
[2020-06-03 05:21:18] [INFO ] Deduced a trap composed of 93 places in 245 ms
[2020-06-03 05:21:18] [INFO ] Deduced a trap composed of 93 places in 151 ms
[2020-06-03 05:21:19] [INFO ] Trap strengthening (SAT) tested/added 3/2 trap constraints in 1252 ms
[2020-06-03 05:21:19] [INFO ] Computed and/alt/rep : 2664/49032/2628 causal constraints in 350 ms.
[2020-06-03 05:21:22] [INFO ] Added : 20 causal constraints over 4 iterations in 3173 ms. Result :(error "Solver has unexpectedly terminated")
[2020-06-03 05:21:22] [INFO ] [Real]Absence check using 22 positive place invariants in 29 ms returned sat
[2020-06-03 05:21:22] [INFO ] [Real]Absence check using 22 positive and 36 generalized place invariants in 92 ms returned sat
[2020-06-03 05:21:22] [INFO ] [Real]Adding state equation constraints to refine reachable states.
[2020-06-03 05:21:29] [INFO ] [Real]Absence check using state equation in 6835 ms returned sat
[2020-06-03 05:21:29] [INFO ] Solution in real domain found non-integer solution.
[2020-06-03 05:21:29] [INFO ] [Nat]Absence check using 22 positive place invariants in 19 ms returned sat
[2020-06-03 05:21:29] [INFO ] [Nat]Absence check using 22 positive and 36 generalized place invariants in 49 ms returned sat
[2020-06-03 05:21:29] [INFO ] [Nat]Adding state equation constraints to refine reachable states.
[2020-06-03 05:21:40] [INFO ] SMT solver returned unknown. Retrying;
[2020-06-03 05:21:43] [INFO ] [Nat]Absence check using state equation in 13671 ms returned unknown
[2020-06-03 05:21:43] [INFO ] [Real]Absence check using 22 positive place invariants in 29 ms returned sat
[2020-06-03 05:21:43] [INFO ] [Real]Absence check using 22 positive and 36 generalized place invariants in 96 ms returned sat
[2020-06-03 05:21:43] [INFO ] [Real]Adding state equation constraints to refine reachable states.
[2020-06-03 05:21:49] [INFO ] [Real]Absence check using state equation in 6249 ms returned sat
[2020-06-03 05:21:49] [INFO ] Solution in real domain found non-integer solution.
[2020-06-03 05:21:49] [INFO ] [Nat]Absence check using 22 positive place invariants in 29 ms returned sat
[2020-06-03 05:21:49] [INFO ] [Nat]Absence check using 22 positive and 36 generalized place invariants in 64 ms returned sat
[2020-06-03 05:21:49] [INFO ] [Nat]Adding state equation constraints to refine reachable states.
[2020-06-03 05:21:58] [INFO ] SMT solver returned unknown. Retrying;
[2020-06-03 05:22:01] [INFO ] [Nat]Absence check using state equation in 11739 ms returned unknown
[2020-06-03 05:22:01] [INFO ] [Real]Absence check using 22 positive place invariants in 17 ms returned sat
[2020-06-03 05:22:01] [INFO ] [Real]Absence check using 22 positive and 36 generalized place invariants in 35 ms returned unsat
Successfully simplified 1 atomic propositions for a total of 1 simplifications.
[2020-06-03 05:22:02] [INFO ] Initial state reduction rules for CTL removed 3 formulas.
[2020-06-03 05:22:02] [INFO ] Flatten gal took : 386 ms
FORMULA PolyORBLF-PT-S06J06T06-14 TRUE TECHNIQUES TOPOLOGICAL INITIAL_STATE
FORMULA PolyORBLF-PT-S06J06T06-10 TRUE TECHNIQUES TOPOLOGICAL INITIAL_STATE
FORMULA PolyORBLF-PT-S06J06T06-09 FALSE TECHNIQUES TOPOLOGICAL INITIAL_STATE
[2020-06-03 05:22:02] [INFO ] Flatten gal took : 136 ms
[2020-06-03 05:22:02] [INFO ] Export to MCC properties in file /home/mcc/execution/LTLFireability.sr.xml took 5 ms.
[2020-06-03 05:22:02] [INFO ] Export to PNML in file /home/mcc/execution/model.sr.pnml took 17 ms.
info: Time: 3600 - MCC
vrfy: Checking LTLFireability @ PolyORBLF-PT-S06J06T06 @ 3570 seconds
check_solution: Variable C238 = -0.949759960175 is below its lower bound 0
check_solution: Variable C1646 = -0.107210874558 is below its lower bound 0
check_solution: Variable C1998 = -0.035963177681 is below its lower bound 0
check_solution: Variable C2350 = -0.0503807365895 is below its lower bound 0
check_solution: Variable C3054 = -0.547356128693 is below its lower bound 0
check_solution: Constraint R8 = 4.45619116282e-311 is above its equality of -9
check_solution: Constraint R10 = 6.340523425e-311 is above its equality of -1
check_solution: Constraint R19 = 5.63814281858e-311 is above its equality of -1
check_solution: Constraint R49 = 6.62911485216e-311 is above its equality of -1
check_solution: Constraint R58 = 1.58513085785e-311 is above its equality of -1

Seriously low accuracy found ||*|| = 10 (rel. error 9.32741)
check_solution: Variable C7 = -1 is below its lower bound 0
check_solution: Variable C10 = -1 is below its lower bound 0
check_solution: Variable C12 = -1 is below its lower bound 0
check_solution: Variable C17 = -1 is below its lower bound 0
check_solution: Variable C20 = -1 is below its lower bound 0
check_solution: Variable C21 = -1 is below its lower bound 0
check_solution: Variable C23 = -1 is below its lower bound 0
check_solution: Variable C24 = -1 is below its lower bound 0
check_solution: Variable C26 = -1 is below its lower bound 0
check_solution: Variable C27 = -1 is below its lower bound 0

Seriously low accuracy found ||*|| = 10 (rel. error 9)
check_solution: Variable C238 = -1.10571670532 is below its lower bound 0
check_solution: Variable C590 = -0.123122513294 is below its lower bound 0
check_solution: Variable C942 = -0.614017009735 is below its lower bound 0
check_solution: Variable C1294 = -0.588991165161 is below its lower bound 0
check_solution: Variable C2350 = -0.0498767495156 is below its lower bound 0
check_solution: Variable C2702 = -0.272653341293 is below its lower bound 0
check_solution: Variable C3054 = -0.713499546051 is below its lower bound 0
check_solution: Constraint R8 = 6.8922423307e-311 is above its equality of -9
check_solution: Constraint R10 = 7.90443432319e-311 is above its equality of -1
check_solution: Constraint R19 = 8.08055997382e-311 is above its equality of -1

Seriously low accuracy found ||*|| = 10 (rel. error 5.65125)
check_solution: Variable C328 = -0.216657876968 is below its lower bound 0
check_solution: Variable C1032 = -0.00972603261471 is below its lower bound 0
check_solution: Variable C1384 = -0.0340451896191 is below its lower bound 0
check_solution: Variable C1736 = -0.08748960495 is below its lower bound 0
check_solution: Variable C2088 = -0.510091781617 is below its lower bound 0
check_solution: Variable C2792 = -0.0731757283211 is below its lower bound 0
check_solution: Variable C3144 = -0.335966348648 is below its lower bound 0
check_solution: Constraint R8 = 5.86095237567e-311 is above its equality of -9
check_solution: Constraint R10 = 2.79891245025e-311 is above its equality of -1
check_solution: Constraint R19 = 6.21108168124e-311 is above its equality of -1

Seriously low accuracy found ||*|| = 10 (rel. error 29.3727)
check_solution: Variable C727 = -11.25 is below its lower bound 0
check_solution: Variable C731 = -9.5 is below its lower bound 0
check_solution: Variable C733 = -2.71428571429 is below its lower bound 0
check_solution: Variable C743 = -3 is below its lower bound 0
check_solution: Variable C859 = -4 is below its lower bound 0
check_solution: Variable C933 = -6.33333333333 is below its lower bound 0
check_solution: Variable C967 = -1 is below its lower bound 0
check_solution: Constraint R8 = 2.12199579146e-314 is above its equality of -9
check_solution: Constraint R10 = 2.12199579146e-314 is above its equality of -1
check_solution: Constraint R19 = 0 is above its equality of -1

Seriously low accuracy found ||*|| = 11.25 (rel. error 11.25)
check_solution: Variable C328 = -0.346500873566 is below its lower bound 0
check_solution: Variable C680 = -0.283655881882 is below its lower bound 0
check_solution: Variable C1384 = -0.193172812462 is below its lower bound 0
check_solution: Variable C2088 = -0.129265904427 is below its lower bound 0
check_solution: Variable C2440 = -0.12067013979 is below its lower bound 0
check_solution: Variable C2792 = -0.29628944397 is below its lower bound 0
check_solution: Variable C3144 = -0.243148684502 is below its lower bound 0
check_solution: Constraint R8 = 5.86095237567e-311 is above its equality of -9
check_solution: Constraint R10 = 2.79891244965e-311 is above its equality of -1
check_solution: Constraint R19 = 6.21108168124e-311 is above its equality of -1

Seriously low accuracy found ||*|| = 10 (rel. error 5.17671)
check_solution: Variable C238 = -0.117689609528 is below its lower bound 0
check_solution: Variable C590 = -0.836146831513 is below its lower bound 0
check_solution: Variable C942 = -0.434388637543 is below its lower bound 0
check_solution: Variable C1294 = -0.260507583618 is below its lower bound 0
check_solution: Variable C1998 = -0.568809509278 is below its lower bound 0
check_solution: Variable C2350 = -0.346500873566 is below its lower bound 0
check_solution: Variable C2702 = -0.283655881882 is below its lower bound 0
check_solution: Constraint R8 = 8.22273369179e-311 is above its equality of -9
check_solution: Constraint R10 = 3.50765904399e-311 is above its equality of -1
check_solution: Constraint R19 = 5.63814281858e-311 is above its equality of -1

Seriously low accuracy found ||*|| = 10 (rel. error 6.21599)
check_solution: Variable C1 = -2 is below its lower bound 0
check_solution: Variable C2 = -3 is below its lower bound 0
check_solution: Variable C3 = -2 is below its lower bound 0
check_solution: Variable C4 = -2 is below its lower bound 0
check_solution: Variable C5 = -2 is below its lower bound 0
check_solution: Variable C6 = -2 is below its lower bound 0
check_solution: Variable C7 = -1 is below its lower bound 0
check_solution: Variable C8 = -1 is below its lower bound 0
check_solution: Variable C9 = -2 is below its lower bound 0
check_solution: Variable C10 = -2 is below its lower bound 0

TIME LIMIT: Killed by timeout after 3600 seconds
MemTotal: 16427456 kB
MemFree: 10855312 kB
After kill :
MemTotal: 16427456 kB
MemFree: 16122412 kB

--------------------
content from stderr:

Sequence of Actions to be Executed by the VM

This is useful if one wants to reexecute the tool in the VM from the submitted image disk.

set -x
# this is for BenchKit: configuration of major elements for the test
export BK_INPUT="PolyORBLF-PT-S06J06T06"
export BK_EXAMINATION="LTLFireability"
export BK_TOOL="itslola"
export BK_RESULT_DIR="/tmp/BK_RESULTS/OUTPUTS"
export BK_TIME_CONFINEMENT="3600"
export BK_MEMORY_CONFINEMENT="16384"

# this is specific to your benchmark or test

export BIN_DIR="$HOME/BenchKit/bin"

# remove the execution directoty if it exists (to avoid increse of .vmdk images)
if [ -d execution ] ; then
rm -rf execution
fi

# this is for BenchKit: explicit launching of the test
echo "====================================================================="
echo " Generated by BenchKit 2-4028"
echo " Executing tool itslola"
echo " Input is PolyORBLF-PT-S06J06T06, examination is LTLFireability"
echo " Time confinement is $BK_TIME_CONFINEMENT seconds"
echo " Memory confinement is 16384 MBytes"
echo " Number of cores is 4"
echo " Run identifier is r176-tajo-158987872000538"
echo "====================================================================="
echo
echo "--------------------"
echo "preparation of the directory to be used:"

tar xzf /home/mcc/BenchKit/INPUTS/PolyORBLF-PT-S06J06T06.tgz
mv PolyORBLF-PT-S06J06T06 execution
cd execution
if [ "LTLFireability" = "ReachabilityDeadlock" ] || [ "LTLFireability" = "UpperBounds" ] || [ "LTLFireability" = "QuasiLiveness" ] || [ "LTLFireability" = "StableMarking" ] || [ "LTLFireability" = "Liveness" ] || [ "LTLFireability" = "OneSafe" ] || [ "LTLFireability" = "StateSpace" ]; then
rm -f GenericPropertiesVerdict.xml
fi
pwd
ls -lh

echo
echo "--------------------"
echo "content from stdout:"
echo
echo "=== Data for post analysis generated by BenchKit (invocation template)"
echo
if [ "LTLFireability" = "UpperBounds" ] ; then
echo "The expected result is a vector of positive values"
echo NUM_VECTOR
elif [ "LTLFireability" != "StateSpace" ] ; then
echo "The expected result is a vector of booleans"
echo BOOL_VECTOR
else
echo "no data necessary for post analysis"
fi
echo
if [ -f "LTLFireability.txt" ] ; then
echo "here is the order used to build the result vector(from text file)"
for x in $(grep Property LTLFireability.txt | cut -d ' ' -f 2 | sort -u) ; do
echo "FORMULA_NAME $x"
done
elif [ -f "LTLFireability.xml" ] ; then # for cunf (txt files deleted;-)
echo echo "here is the order used to build the result vector(from xml file)"
for x in $(grep '' LTLFireability.xml | cut -d '>' -f 2 | cut -d '<' -f 1 | sort -u) ; do
echo "FORMULA_NAME $x"
done
elif [ "LTLFireability" = "ReachabilityDeadlock" ] || [ "LTLFireability" = "QuasiLiveness" ] || [ "LTLFireability" = "StableMarking" ] || [ "LTLFireability" = "Liveness" ] || [ "LTLFireability" = "OneSafe" ] ; then
echo "FORMULA_NAME LTLFireability"
fi
echo
echo "=== Now, execution of the tool begins"
echo
echo -n "BK_START "
date -u +%s%3N
echo
timeout -s 9 $BK_TIME_CONFINEMENT bash -c "/home/mcc/BenchKit/BenchKit_head.sh 2> STDERR ; echo ; echo -n \"BK_STOP \" ; date -u +%s%3N"
if [ $? -eq 137 ] ; then
echo
echo "BK_TIME_CONFINEMENT_REACHED"
fi
echo
echo "--------------------"
echo "content from stderr:"
echo
cat STDERR ;