fond
Model Checking Contest 2021
11th edition, Paris, France, June 23, 2021
Execution of r223-tall-162098215800034
Last Updated
Jun 28, 2021

About the Execution of ITS-Tools for SharedMemory-COL-000500

Execution Summary
Max Memory
Used (MB)
Time wait (ms) CPU Usage (ms) I/O Wait (ms) Computed Result Execution
Status
16245.823 1800000.00 3732758.00 514120.00 [undef] Time out reached

Execution Chart

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

Trace from the execution

Formatting '/data/fkordon/mcc2021-input.r223-tall-162098215800034.qcow2', fmt=qcow2 size=4294967296 backing_file='/data/fkordon/mcc2021-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 itstools
Input is SharedMemory-COL-000500, examination is Liveness
Time confinement is 1800 seconds
Memory confinement is 16384 MBytes
Number of cores is 4
Run identifier is r223-tall-162098215800034
=====================================================================

--------------------
preparation of the directory to be used:
/home/mcc/execution
total 388K
-rw-r--r-- 1 mcc users 15K May 5 16:58 CTLCardinality.txt
-rw-r--r-- 1 mcc users 122K May 10 09:44 CTLCardinality.xml
-rw-r--r-- 1 mcc users 12K May 5 16:58 CTLFireability.txt
-rw-r--r-- 1 mcc users 81K May 10 09:44 CTLFireability.xml
-rw-r--r-- 1 mcc users 4.2K May 6 14:48 GenericPropertiesDefinition.xml
-rw-r--r-- 1 mcc users 3.6K Mar 28 16:35 LTLCardinality.txt
-rw-r--r-- 1 mcc users 23K Mar 28 16:35 LTLCardinality.xml
-rw-r--r-- 1 mcc users 2.5K Mar 28 16:35 LTLFireability.txt
-rw-r--r-- 1 mcc users 18K Mar 28 16:35 LTLFireability.xml
-rw-r--r-- 1 mcc users 3.5K Mar 27 11:50 ReachabilityCardinality.txt
-rw-r--r-- 1 mcc users 16K Mar 27 11:50 ReachabilityCardinality.xml
-rw-r--r-- 1 mcc users 2.8K Mar 25 17:38 ReachabilityFireability.txt
-rw-r--r-- 1 mcc users 12K Mar 25 17:38 ReachabilityFireability.xml
-rw-r--r-- 1 mcc users 1.8K Mar 22 08:16 UpperBounds.txt
-rw-r--r-- 1 mcc users 3.8K Mar 22 08:16 UpperBounds.xml
-rw-r--r-- 1 mcc users 5 May 5 16:52 equiv_pt
-rw-r--r-- 1 mcc users 7 May 5 16:52 instance
-rw-r--r-- 1 mcc users 5 May 5 16:52 iscolored
-rw-r--r-- 1 mcc users 33K May 5 16:52 model.pnml

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

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

The expected result is a vector of booleans
BOOL_VECTOR

FORMULA_NAME Liveness

=== Now, execution of the tool begins

BK_START 1621065645106

Running Version 0
[2021-05-15 08:00:46] [INFO ] Running its-tools with arguments : [-pnfolder, /home/mcc/execution, -examination, Liveness, -spotpath, /home/mcc/BenchKit/bin//..//ltlfilt, -z3path, /home/mcc/BenchKit/bin//..//z3/bin/z3, -yices2path, /home/mcc/BenchKit/bin//..//yices/bin/yices, -its, -ltsmin, -greatspnpath, /home/mcc/BenchKit/bin//..//greatspn/, -order, META, -manyOrder, -smt, -timeout, 1800]
[2021-05-15 08:00:47] [INFO ] Parsing pnml file : /home/mcc/execution/model.pnml
[2021-05-15 08:00:47] [INFO ] Detected file is not PT type :http://www.pnml.org/version-2009/grammar/symmetricnet
log4j:WARN No appenders could be found for logger (org.apache.axiom.locator.DefaultOMMetaFactoryLocator).
log4j:WARN Please initialize the log4j system properly.
[2021-05-15 08:00:47] [WARNING] Using fallBack plugin, rng conformance not checked
[2021-05-15 08:00:47] [INFO ] Load time of PNML (colored model parsed with PNMLFW) : 525 ms
[2021-05-15 08:00:47] [INFO ] Imported 6 HL places and 5 HL transitions for a total of 252001 PT places and 751000.0 transition bindings in 21 ms.
[2021-05-15 08:00:47] [INFO ] Built PT skeleton of HLPN with 6 places and 5 transitions in 4 ms.
[2021-05-15 08:00:47] [INFO ] Skeletonized HLPN properties in 0 ms.
Successfully produced net in file /tmp/petri1000_16124026752872011940.dot
[2021-05-15 08:00:49] [INFO ] Unfolded HLPN to a Petri net with 252001 places and 501000 transitions in 1463 ms.
[2021-05-15 08:00:49] [INFO ] Unfolded HLPN properties in 0 ms.
[2021-05-15 08:00:50] [INFO ] Unfolded HLPN to a Petri net with 252001 places and 501000 transitions in 875 ms.
[2021-05-15 08:00:50] [INFO ] Unfolded HLPN properties in 44 ms.
Successfully produced net in file /tmp/petri1001_10878765192890008309.dot
[2021-05-15 08:00:53] [INFO ] Built PT skeleton of HLPN with 6 places and 5 transitions in 0 ms.
[2021-05-15 08:00:53] [INFO ] Skeletonized HLPN properties in 0 ms.
Successfully produced net in file /tmp/petri1002_11929013984406400180.dot
Prefix of Interest using HLPN skeleton for deadlock discarded 0 places and 0 transitions.
[2021-05-15 08:00:54] [INFO ] Unfolded HLPN to a Petri net with 252001 places and 501000 transitions in 905 ms.
[2021-05-15 08:00:54] [INFO ] Unfolded HLPN properties in 16 ms.
Successfully produced net in file /tmp/petri1003_18108566942593704288.dot
Deduced a syphon composed of 500 places in 294 ms
Reduce places removed 500 places and 500 transitions.
Built sparse matrix representations for Structural reductions in 173 ms.2774534KB memory used
Starting structural reductions, iteration 0 : 251501/251501 places, 500500/500500 transitions.
Applied a total of 0 rules in 4294 ms. Remains 251501 /251501 variables (removed 0) and now considering 500500/500500 (removed 0) transitions.
Finished structural reductions, in 1 iterations. Remains : 251501/251501 places, 500500/500500 transitions.
Starting structural reductions, iteration 0 : 251501/251501 places, 500500/500500 transitions.
Applied a total of 0 rules in 3893 ms. Remains 251501 /251501 variables (removed 0) and now considering 500500/500500 (removed 0) transitions.
// Phase 1: matrix 500500 rows 251501 cols
[2021-05-15 08:03:06] [WARNING] Invariant computation timed out after 120 seconds.
[2021-05-15 08:03:28] [INFO ] Implicit Places using invariants in 142243 ms returned []
Implicit Place search using SMT only with invariants took 142266 ms to find 0 implicit places.
// Phase 1: matrix 500500 rows 251501 cols
[2021-05-15 08:05:29] [WARNING] Invariant computation timed out after 120 seconds.
[2021-05-15 08:05:44] [INFO ] Dead Transitions using invariants and state equation in 135424 ms returned []
Finished structural reductions, in 1 iterations. Remains : 251501/251501 places, 500500/500500 transitions.
Interrupted Random walk after 1280 steps, including 0 resets, run timeout after 32499 ms. (steps per millisecond=0 )
// Phase 1: matrix 500500 rows 251501 cols
[2021-05-15 08:08:17] [WARNING] Invariant computation timed out after 120 seconds.
Interrupted Random directed walk after 30386 steps, including 0 resets, run timeout after 30344 ms. (steps per millisecond=1 )
Interrupted Random walk after 1053 steps, including 0 resets, run timeout after 34181 ms. (steps per millisecond=0 )
Interrupted Random directed walk after 19119 steps, including 0 resets, run timeout after 33679 ms. (steps per millisecond=0 )
Interrupted Random walk after 1351 steps, including 0 resets, run timeout after 40671 ms. (steps per millisecond=0 )
Starting structural reductions, iteration 0 : 251501/251501 places, 500500/500500 transitions.
Applied a total of 0 rules in 5907 ms. Remains 251501 /251501 variables (removed 0) and now considering 500500/500500 (removed 0) transitions.
// Phase 1: matrix 500500 rows 251501 cols
[2021-05-15 08:17:46] [WARNING] Invariant computation timed out after 120 seconds.
[2021-05-15 08:18:36] [INFO ] Implicit Places using invariants in 171129 ms returned []
Implicit Place search using SMT only with invariants took 171222 ms to find 0 implicit places.
// Phase 1: matrix 500500 rows 251501 cols
[2021-05-15 08:20:41] [WARNING] Invariant computation timed out after 120 seconds.
[2021-05-15 08:21:46] [INFO ] Dead Transitions with SMT raised an exceptionSMT solver raised an error when submitting script. Raised (error "Failed to assert expression: java.io.IOException: Stream close... after 189847 ms
Finished structural reductions, in 1 iterations. Remains : 251501/251501 places, 500500/500500 transitions.
Interrupted Random walk after 1001 steps, including 0 resets, run timeout after 34494 ms. (steps per millisecond=0 )
// Phase 1: matrix 500500 rows 251501 cols
[2021-05-15 08:24:33] [WARNING] Invariant computation timed out after 120 seconds.

BK_TIME_CONFINEMENT_REACHED

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

+ export BINDIR=/home/mcc/BenchKit/bin//../
+ BINDIR=/home/mcc/BenchKit/bin//../
++ pwd
+ export MODEL=/home/mcc/execution
+ MODEL=/home/mcc/execution
+ [[ Liveness = StateSpace ]]
+ /home/mcc/BenchKit/bin//..//runeclipse.sh /home/mcc/execution Liveness -its -ltsmin -greatspnpath /home/mcc/BenchKit/bin//..//greatspn/ -order META -manyOrder -smt -timeout 1800
+ ulimit -s 65536
+ [[ -z '' ]]
+ export LTSMIN_MEM_SIZE=8589934592
+ LTSMIN_MEM_SIZE=8589934592
++ cut -d . -f 9
++ ls /home/mcc/BenchKit/bin//..//itstools/plugins/fr.lip6.move.gal.application.pnmcc_1.0.0.202104292328.jar
+ VERSION=0
+ echo 'Running Version 0'
+ /home/mcc/BenchKit/bin//..//itstools/its-tools -data /home/mcc/execution/workspace -pnfolder /home/mcc/execution -examination Liveness -spotpath /home/mcc/BenchKit/bin//..//ltlfilt -z3path /home/mcc/BenchKit/bin//..//z3/bin/z3 -yices2path /home/mcc/BenchKit/bin//..//yices/bin/yices -its -ltsmin -greatspnpath /home/mcc/BenchKit/bin//..//greatspn/ -order META -manyOrder -smt -timeout 1800 -vmargs -Dosgi.locking=none -Declipse.stateSaveDelayInterval=-1 -Dosgi.configuration.area=/tmp/.eclipse -Xss128m -Xms40m -Xmx16000m

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="SharedMemory-COL-000500"
export BK_EXAMINATION="Liveness"
export BK_TOOL="itstools"
export BK_RESULT_DIR="/tmp/BK_RESULTS/OUTPUTS"
export BK_TIME_CONFINEMENT="1800"
export BK_MEMORY_CONFINEMENT="16384"
export BK_BIN_PATH="/home/mcc/BenchKit/bin/"

# 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 itstools"
echo " Input is SharedMemory-COL-000500, examination is Liveness"
echo " Time confinement is $BK_TIME_CONFINEMENT seconds"
echo " Memory confinement is 16384 MBytes"
echo " Number of cores is 4"
echo " Run identifier is r223-tall-162098215800034"
echo "====================================================================="
echo
echo "--------------------"
echo "preparation of the directory to be used:"

tar xzf /home/mcc/BenchKit/INPUTS/SharedMemory-COL-000500.tgz
mv SharedMemory-COL-000500 execution
cd execution
if [ "Liveness" = "ReachabilityDeadlock" ] || [ "Liveness" = "UpperBounds" ] || [ "Liveness" = "QuasiLiveness" ] || [ "Liveness" = "StableMarking" ] || [ "Liveness" = "Liveness" ] || [ "Liveness" = "OneSafe" ] || [ "Liveness" = "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 [ "Liveness" = "UpperBounds" ] ; then
echo "The expected result is a vector of positive values"
echo NUM_VECTOR
elif [ "Liveness" != "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 "Liveness.txt" ] ; then
echo "here is the order used to build the result vector(from text file)"
for x in $(grep Property Liveness.txt | cut -d ' ' -f 2 | sort -u) ; do
echo "FORMULA_NAME $x"
done
elif [ -f "Liveness.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 '' Liveness.xml | cut -d '>' -f 2 | cut -d '<' -f 1 | sort -u) ; do
echo "FORMULA_NAME $x"
done
elif [ "Liveness" = "ReachabilityDeadlock" ] || [ "Liveness" = "QuasiLiveness" ] || [ "Liveness" = "StableMarking" ] || [ "Liveness" = "Liveness" ] || [ "Liveness" = "OneSafe" ] ; then
echo "FORMULA_NAME Liveness"
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 ;