1-LastTest.log

1-LastTest.log (text/plain), 55.50 KB, created by Agostino Sarubbo on 2021-08-09 17:13:37 UTC

Start testing: Aug 09 19:00 CEST
----------------------------------------------------------
1/17 Testing: _ctest_topic_tools_gtest_topic_tools-utest
1/17 Test: _ctest_topic_tools_gtest_topic_tools-utest
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/gtest-topic_tools-utest.xml" "--return-code" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/devel/libexec/topic_tools/topic_tools-utest --gtest_output=xml:/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/gtest-topic_tools-utest.xml"
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_gtest_topic_tools-utest" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
[==========] Running 6 tests from 1 test suite.
[----------] Global test environment set-up.
[----------] 6 tests from GetBaseName
[ RUN      ] GetBaseName.simpleName
[       OK ] GetBaseName.simpleName (0 ms)
[ RUN      ] GetBaseName.leadingSlash
[       OK ] GetBaseName.leadingSlash (0 ms)
[ RUN      ] GetBaseName.trailingSlash
[       OK ] GetBaseName.trailingSlash (0 ms)
[ RUN      ] GetBaseName.multipleLevels
[       OK ] GetBaseName.multipleLevels (0 ms)
[ RUN      ] GetBaseName.multipleSlashes
[       OK ] GetBaseName.multipleSlashes (0 ms)
[ RUN      ] GetBaseName.emptyName
[31m[ERROR] [1628528400.796734205]: Base name extracted from "///" is an empty string[0m
[       OK ] GetBaseName.emptyName (0 ms)
[----------] 6 tests from GetBaseName (0 ms total)

[----------] Global test environment tear-down
[==========] 6 tests from 1 test suite ran. (0 ms total)
[  PASSED  ] 6 tests.
-- run_tests.py: execute commands
  /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/devel/libexec/topic_tools/topic_tools-utest --gtest_output=xml:/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/gtest-topic_tools-utest.xml
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/gtest-topic_tools-utest.xml"
<end of output>
Test time =   0.11 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_gtest_topic_tools-utest" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_gtest_topic_tools-utest" time elapsed: 00:00:00
----------------------------------------------------------

17/17 Testing: _ctest_topic_tools_nosetests_test.args.py
17/17 Test: _ctest_topic_tools_nosetests_test.args.py
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/nosetests-test.args.py.xml" "--return-code" ""/usr/bin/cmake" -E make_directory /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools" "/usr/bin/nosetests -P --process-timeout=60 /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/args.py --with-xunit --xunit-file=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/nosetests-test.args.py.xml"
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_nosetests_test.args.py" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Unable to create temporary cache file /var/lib/portage/home/.ros/.rospack_cache.loJYea: No such file or directory

usage: drop IN_TOPIC X Y [OUT_TOPIC]

 This program will drop X out of every Y messages from IN_TOPIC,
 forwarding the rest to OUT_TOPIC if given, else to a topic 
 named IN_TOPIC_drop


[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Unable to create temporary cache file /var/lib/portage/home/.ros/.rospack_cache.TWzKHD: No such file or directory
[31m[ERROR] [1628528402.062644525]: Base name extracted from "//" is an empty string[0m
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Unable to create temporary cache file /var/lib/portage/home/.ros/.rospack_cache.vRMZNf: No such file or directory

usage: drop IN_TOPIC X Y [OUT_TOPIC]

 This program will drop X out of every Y messages from IN_TOPIC,
 forwarding the rest to OUT_TOPIC if given, else to a topic 
 named IN_TOPIC_drop


[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Unable to create temporary cache file /var/lib/portage/home/.ros/.rospack_cache.8WLJeu: No such file or directory

usage: drop IN_TOPIC X Y [OUT_TOPIC]

 This program will drop X out of every Y messages from IN_TOPIC,
 forwarding the rest to OUT_TOPIC if given, else to a topic 
 named IN_TOPIC_drop


[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Unable to create temporary cache file /var/lib/portage/home/.ros/.rospack_cache.L7CUyc: No such file or directory

usage: drop IN_TOPIC X Y [OUT_TOPIC]

 This program will drop X out of every Y messages from IN_TOPIC,
 forwarding the rest to OUT_TOPIC if given, else to a topic 
 named IN_TOPIC_drop


.[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Unable to create temporary cache file /var/lib/portage/home/.ros/.rospack_cache.9xM9f6: No such file or directory

usage: mux OUT_TOPIC IN_TOPIC1 [IN_TOPIC2 [...]]

[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Unable to create temporary cache file /var/lib/portage/home/.ros/.rospack_cache.bgXGhr: No such file or directory
[31m[ERROR] [1628528403.564564423]: Base name extracted from "//" is an empty string[0m
.[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Unable to create temporary cache file /var/lib/portage/home/.ros/.rospack_cache.4owU6S: No such file or directory

usage: relay IN_TOPIC [OUT_TOPIC]

[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Unable to create temporary cache file /var/lib/portage/home/.ros/.rospack_cache.SLW28l: No such file or directory
[31m[ERROR] [1628528404.127585618]: Base name extracted from "//" is an empty string[0m
.[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Unable to create temporary cache file /var/lib/portage/home/.ros/.rospack_cache.rYpBrF: No such file or directory
[33m[ WARN] [1628528404.404223150]: topic_tools/switch_mux is deprecated; please use topic_tools/mux_select instead[0m
usage: switch MUXED_TOPIC SELECT_TOPIC
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Warning: cannot create rospack cache directory /var/lib/portage/home/.ros: boost::filesystem::create_directory: Permission denied: "/var/lib/portage/home/.ros"
[rospack] Unable to create temporary cache file /var/lib/portage/home/.ros/.rospack_cache.QFSZKX: No such file or directory
[33m[ WARN] [1628528404.687923947]: topic_tools/switch_mux is deprecated; please use topic_tools/mux_select instead[0m
[31m[ERROR] [1628528404.687992830]: Base name extracted from "//" is an empty string[0m
.
----------------------------------------------------------------------
Ran 4 tests in 3.410s

OK
-- run_tests.py: execute commands
  "/usr/bin/cmake" -E make_directory /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools
  /usr/bin/nosetests -P --process-timeout=60 /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/args.py --with-xunit --xunit-file=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/nosetests-test.args.py.xml
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/nosetests-test.args.py.xml"
<end of output>
Test time =   4.00 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_nosetests_test.args.py" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_nosetests_test.args.py" time elapsed: 00:00:03
----------------------------------------------------------

2/17 Testing: _ctest_topic_tools_rostest_test_shapeshifter.test
2/17 Test: _ctest_topic_tools_rostest_test_shapeshifter.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_shapeshifter.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_shapeshifter.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/shapeshifter.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_shapeshifter.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-152.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_shapeshifter.xml
[Testcase: testtest_shapeshifter] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-test_shapeshifter/testInstantiateString][passed]
[topic_tools.rosunit-test_shapeshifter/testInstantiateInt][passed]
[topic_tools.rosunit-test_shapeshifter/testLoopback][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 3
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-152.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_shapeshifter.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/shapeshifter.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_shapeshifter.xml"
<end of output>
Test time =   4.38 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_shapeshifter.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_shapeshifter.test" time elapsed: 00:00:04
----------------------------------------------------------

5/17 Testing: _ctest_topic_tools_rostest_test_throttle_simtime_loop.test
5/17 Test: _ctest_topic_tools_rostest_test_throttle_simtime_loop.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_throttle_simtime_loop.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_throttle_simtime_loop.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/throttle_simtime_loop.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_throttle_simtime_loop.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
[33m[ WARN] [1628528403.689353646]: Detected jump back in time, resetting throttle period to now for.[0m
advertised as input_throttle
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-159.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_throttle_simtime_loop.xml
[Testcase: testthrottle_simtime_loop] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-throttle_simtime_loop/test_throttle_loop][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 1
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-159.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_throttle_simtime_loop.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/throttle_simtime_loop.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_throttle_simtime_loop.xml"
<end of output>
Test time =   5.00 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_throttle_simtime_loop.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_throttle_simtime_loop.test" time elapsed: 00:00:04
----------------------------------------------------------

11/17 Testing: _ctest_topic_tools_rostest_test_mux_initial_other.test
11/17 Test: _ctest_topic_tools_rostest_test_mux_initial_other.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_mux_initial_other.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_mux_initial_other.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/mux_initial_other.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_mux_initial_other.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
[0m[ INFO] [1628528401.620931939]: trying to switch mux to input2[0m
[0m[ INFO] [1628528401.622430275]: mux selected input: [/input2][0m
[0m[ INFO] [1628528403.366889035]: advertising[0m
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-164.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_mux_initial_other.xml
[Testcase: testmux_hztest_explicit] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-mux_hztest_explicit/test_hz][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 1
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-164.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_mux_initial_other.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/mux_initial_other.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_mux_initial_other.xml"
<end of output>
Test time =   5.44 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_mux_initial_other.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_mux_initial_other.test" time elapsed: 00:00:05
----------------------------------------------------------

13/17 Testing: _ctest_topic_tools_rostest_test_mux.test
13/17 Test: _ctest_topic_tools_rostest_test_mux.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_mux.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_mux.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/mux.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_mux.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
[0m[ INFO] [1628528403.116047536]: advertising[0m
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-166.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_mux.xml
[Testcase: testmux_hztest_explicit] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-mux_hztest_explicit/test_hz][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 1
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-166.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_mux.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/mux.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_mux.xml"
<end of output>
Test time =   6.20 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_mux.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_mux.test" time elapsed: 00:00:06
----------------------------------------------------------

9/17 Testing: _ctest_topic_tools_rostest_test_lazy_transport.test
9/17 Test: _ctest_topic_tools_rostest_test_lazy_transport.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_lazy_transport.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_lazy_transport.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/lazy_transport.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_lazy_transport.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-163.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_lazy_transport.xml
[Testcase: testtest_lazy_transport] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-test_lazy_transport/test_no_subscribers][passed]
[topic_tools.rosunit-test_lazy_transport/test_subscriber_appears][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 2
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-163.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_lazy_transport.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/lazy_transport.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_lazy_transport.xml"
<end of output>
Test time =   6.36 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_lazy_transport.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_lazy_transport.test" time elapsed: 00:00:06
----------------------------------------------------------

14/17 Testing: _ctest_topic_tools_rostest_test_switch_mux.test
14/17 Test: _ctest_topic_tools_rostest_test_switch_mux.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_switch_mux.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_switch_mux.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/switch_mux.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_switch_mux.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
INFO: cannot create a symlink to latest log directory: [Errno 17] File exists: '/var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/3c2e7394-f933-11eb-a01d-1f4a71799be5' -> '/var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/latest'
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-158.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_switch_mux.xml
[Testcase: testswitch_mux_hztest_explicit] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-switch_mux_hztest_explicit/test_hz][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 1
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-158.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_switch_mux.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/switch_mux.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_switch_mux.xml"
<end of output>
Test time =   6.41 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_switch_mux.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_switch_mux.test" time elapsed: 00:00:06
----------------------------------------------------------

15/17 Testing: _ctest_topic_tools_rostest_test_switch_mux_leading_slash.test
15/17 Test: _ctest_topic_tools_rostest_test_switch_mux_leading_slash.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_switch_mux_leading_slash.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_switch_mux_leading_slash.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/switch_mux_leading_slash.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_switch_mux_leading_slash.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-167.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_switch_mux_leading_slash.xml
[Testcase: testswitch_mux_leading_slash_hztest_explicit] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-switch_mux_leading_slash_hztest_explicit/test_hz][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 1
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-167.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_switch_mux_leading_slash.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/switch_mux_leading_slash.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_switch_mux_leading_slash.xml"
<end of output>
Test time =   6.42 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_switch_mux_leading_slash.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_switch_mux_leading_slash.test" time elapsed: 00:00:06
----------------------------------------------------------

4/17 Testing: _ctest_topic_tools_rostest_test_throttle_simtime.test
4/17 Test: _ctest_topic_tools_rostest_test_throttle_simtime.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_throttle_simtime.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_throttle_simtime.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/throttle_simtime.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_throttle_simtime.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-154.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_throttle_simtime.xml
[Testcase: testthrottle_simtime_hztest] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-throttle_simtime_hztest/test_hz][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 1
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-154.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_throttle_simtime.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/throttle_simtime.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_throttle_simtime.xml"
<end of output>
Test time =   6.48 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_throttle_simtime.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_throttle_simtime.test" time elapsed: 00:00:06
----------------------------------------------------------

6/17 Testing: _ctest_topic_tools_rostest_test_drop.test
6/17 Test: _ctest_topic_tools_rostest_test_drop.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_drop.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_drop.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/drop.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_drop.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-153.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_drop.xml
[Testcase: testdrop_hztest] ... ok
[Testcase: testdrop_hztest_explicit] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-drop_hztest/test_hz][passed]
[topic_tools.rosunit-drop_hztest_explicit/test_hz][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 2
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-153.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_drop.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/drop.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_drop.xml"
<end of output>
Test time =  11.59 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_drop.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_drop.test" time elapsed: 00:00:11
----------------------------------------------------------

7/17 Testing: _ctest_topic_tools_rostest_test_relay.test
7/17 Test: _ctest_topic_tools_rostest_test_relay.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_relay.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_relay.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/relay.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_relay.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-156.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_relay.xml
[Testcase: testrelay_hztest] ... ok
[Testcase: testrelay_hztest_explicit] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-relay_hztest/test_hz][passed]
[topic_tools.rosunit-relay_hztest_explicit/test_hz][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 2
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-156.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_relay.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/relay.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_relay.xml"
<end of output>
Test time =  11.96 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_relay.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_relay.test" time elapsed: 00:00:11
----------------------------------------------------------

8/17 Testing: _ctest_topic_tools_rostest_test_relay_stealth.test
8/17 Test: _ctest_topic_tools_rostest_test_relay_stealth.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_relay_stealth.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_relay_stealth.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/relay_stealth.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_relay_stealth.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
[0m[ INFO] [1628528403.850107408]: advertised as /relay_stealth/output
[0m
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-162.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_relay_stealth.xml
[Testcase: testtest_relay_stealth] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-test_relay_stealth/test_stealth_relay][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 1
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-162.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_relay_stealth.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/relay_stealth.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_relay_stealth.xml"
<end of output>
Test time =  18.17 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_relay_stealth.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_relay_stealth.test" time elapsed: 00:00:18
----------------------------------------------------------

3/17 Testing: _ctest_topic_tools_rostest_test_throttle.test
3/17 Test: _ctest_topic_tools_rostest_test_throttle.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_throttle.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_throttle.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/throttle.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_throttle.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-151.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_throttle.xml
[Testcase: testthrottle_hztest] ... ok
[Testcase: testthrottle_hztest_bytes] ... ok
[Testcase: testthrottle_hztest_explicit] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-throttle_hztest/test_hz][passed]
[topic_tools.rosunit-throttle_hztest_bytes/test_hz][passed]
[topic_tools.rosunit-throttle_hztest_explicit/test_hz][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 3
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-151.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_throttle.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/throttle.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_throttle.xml"
<end of output>
Test time =  19.36 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_throttle.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_throttle.test" time elapsed: 00:00:19
----------------------------------------------------------

10/17 Testing: _ctest_topic_tools_rostest_test_mux_initial_none.test
10/17 Test: _ctest_topic_tools_rostest_test_mux_initial_none.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_mux_initial_none.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_mux_initial_none.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/mux_initial_none.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_mux_initial_none.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
[0m[ INFO] [1628528401.407720647]: mux selected to no input.[0m
[0m[ INFO] [1628528403.121393757]: advertising[0m
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-160.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_mux_initial_none.xml
[Testcase: testmux_initial_topic_none_test] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-mux_initial_topic_none_test/test_hz][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 1
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-160.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_mux_initial_none.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/mux_initial_none.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_mux_initial_none.xml"
<end of output>
Test time =  24.91 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_mux_initial_none.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_mux_initial_none.test" time elapsed: 00:00:24
----------------------------------------------------------

16/17 Testing: _ctest_topic_tools_rostest_test_switch_mux_none.test
16/17 Test: _ctest_topic_tools_rostest_test_switch_mux_none.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_switch_mux_none.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_switch_mux_none.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/switch_mux_none.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_switch_mux_none.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-161.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_switch_mux_none.xml
[Testcase: testswitch_mux_none_hztest_explicit] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-switch_mux_none_hztest_explicit/test_hz][passed]

SUMMARY
[32m * RESULT: SUCCESS[0m
 * TESTS: 1
 * ERRORS: 0
 * FAILURES: 0

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-161.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_switch_mux_none.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/switch_mux_none.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_switch_mux_none.xml"
<end of output>
Test time =  26.14 sec
----------------------------------------------------------
Test Passed.
"_ctest_topic_tools_rostest_test_switch_mux_none.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_switch_mux_none.test" time elapsed: 00:00:26
----------------------------------------------------------

12/17 Testing: _ctest_topic_tools_rostest_test_transform.test
12/17 Test: _ctest_topic_tools_rostest_test_transform.test
Command: "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/catkin_generated/env_cached.sh" "/usr/bin/python3.9" "/usr/share/catkin/cmake/test/run_tests.py" "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_transform.xml" "--return-code" "/usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_transform.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/transform.test "
Directory: /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build
"_ctest_topic_tools_rostest_test_transform.test" start time: Aug 09 19:00 CEST
Output:
----------------------------------------------------------
WARNING: topic [/num1] does not appear to be published yet
WARNING: topic [/foo/num3] does not appear to be published yet
WARNING: topic [/num1] does not appear to be published yet
WARNING: topic [/foo/num3] does not appear to be published yet
WARNING: topic [/num1] does not appear to be published yet
WARNING: topic [/foo/num3] does not appear to be published yet
WARNING: topic [/num1] does not appear to be published yet
WARNING: topic [/foo/num3] does not appear to be published yet
WARNING: topic [/foo/num3] does not appear to be published yet
WARNING: topic [/num1] does not appear to be published yet
WARNING: topic [/num1] does not appear to be published yet
WARNING: topic [/foo/num3] does not appear to be published yet
WARNING: topic [/num1] does not appear to be published yet
WARNING: topic [/foo/num3] does not appear to be published yet
WARNING: topic [/foo/num3] does not appear to be published yet
WARNING: topic [/num1] does not appear to be published yet
... logging to /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-157.log
[ROSUNIT] Outputting test results to /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_transform.xml
[Testcase: testtransform_] ... ok
[Testcase: testtransform_ns] ... ok

[ROSTEST]-----------------------------------------------------------------------

[topic_tools.rosunit-transform_/test_transform_sub][FAILURE]--------------------
timeout exceeded while waiting for message on topic input
  File "/usr/lib/python3.9/unittest/case.py", line 59, in testPartExecutor
    yield
  File "/usr/lib/python3.9/unittest/case.py", line 593, in run
    self._callTestMethod(testMethod)
  File "/usr/lib/python3.9/unittest/case.py", line 550, in _callTestMethod
    method()
  File "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/test_transform.py", line 55, in test_transform_sub
    self.fail(str(e))
  File "/usr/lib/python3.9/unittest/case.py", line 670, in fail
    raise self.failureException(msg)
--------------------------------------------------------------------------------

[topic_tools.rosunit-transform_ns/test_transform_sub][FAILURE]------------------
timeout exceeded while waiting for message on topic input
  File "/usr/lib/python3.9/unittest/case.py", line 59, in testPartExecutor
    yield
  File "/usr/lib/python3.9/unittest/case.py", line 593, in run
    self._callTestMethod(testMethod)
  File "/usr/lib/python3.9/unittest/case.py", line 550, in _callTestMethod
    method()
  File "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/test_transform.py", line 55, in test_transform_sub
    self.fail(str(e))
  File "/usr/lib/python3.9/unittest/case.py", line 670, in fail
    raise self.failureException(msg)
--------------------------------------------------------------------------------


SUMMARY
[1;31m * RESULT: FAIL[0m
 * TESTS: 2
 * ERRORS: 0
[1;31m * FAILURES: 2[0m

rostest log file is in /var/tmp/portage/dev-ros/topic_tools-1.15.11/homedir/.ros/log/rostest-localhost-157.log
-- run_tests.py: execute commands
  /usr/bin/python3.9 /usr/share/rostest/cmake/../../../bin/rostest --pkgdir=/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools --package=topic_tools --results-filename test_transform.xml --results-base-dir "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results" /var/tmp/portage/dev-ros/topic_tools-1.15.11/work/ros_comm-1.15.11/tools/topic_tools/test/transform.test 
-- run_tests.py: verify result "/var/tmp/portage/dev-ros/topic_tools-1.15.11/work/topic_tools-1.15.11_build/test_results/topic_tools/rostest-test_transform.xml"
<end of output>
Test time =  26.70 sec
----------------------------------------------------------
Test Failed.
"_ctest_topic_tools_rostest_test_transform.test" end time: Aug 09 19:00 CEST
"_ctest_topic_tools_rostest_test_transform.test" time elapsed: 00:00:26
----------------------------------------------------------

End testing: Aug 09 19:00 CEST