maas-builds team mailing list archive

[MAAS Jenkins <devnull@xxxxxxxxxxxxx>]

Built with lp:maas/1.9 (revno: 4537) and lp:~maas-maintainers/maas/packaging-1.9 (revno: 434)

See http://162.213.35.104:8080/job/maas-trusty-1.9/40/

[...truncated 20128 lines...]
tar: ./src/provisioningserver/pserv_services/tests/test_dhcp_probe_service.py: time stamp 2016-01-19 18:50:57 is 16201.094017626 s in the future
tar: ./src/provisioningserver/pserv_services/tests: time stamp 2016-01-19 18:51:00 is 16204.093744579 s in the future
tar: ./src/provisioningserver/pserv_services/tftp.py: time stamp 2016-01-19 18:50:57 is 16201.093326611 s in the future
tar: ./src/provisioningserver/pserv_services/service_monitor_service.py: time stamp 2016-01-19 18:50:57 is 16201.092948369 s in the future
tar: ./src/provisioningserver/pserv_services/image_download_service.py: time stamp 2016-01-19 18:50:57 is 16201.092543236 s in the future
tar: ./src/provisioningserver/pserv_services/__init__.py: time stamp 2016-01-19 18:50:57 is 16201.09219124 s in the future
tar: ./src/provisioningserver/pserv_services/lease_upload_service.py: time stamp 2016-01-19 18:50:57 is 16201.09177712 s in the future
tar: ./src/provisioningserver/pserv_services: time stamp 2016-01-19 18:51:00 is 16204.091468228 s in the future
tar: ./src/provisioningserver/auth.py: time stamp 2016-01-19 18:50:57 is 16201.091104723 s in the future
tar: ./src/provisioningserver/tags.py: time stamp 2016-01-19 18:50:57 is 16201.090739516 s in the future
tar: ./src/provisioningserver/plugin.py: time stamp 2016-01-19 18:50:57 is 16201.090315336 s in the future
tar: ./src/provisioningserver/config.py: time stamp 2016-01-19 18:50:57 is 16201.089848807 s in the future
tar: ./src/provisioningserver/network.py: time stamp 2016-01-19 18:50:57 is 16201.089246051 s in the future
tar: ./src/provisioningserver/logger/tests/__init__.py: time stamp 2016-01-19 18:50:57 is 16201.088682961 s in the future
tar: ./src/provisioningserver/logger/tests/test_logger.py: time stamp 2016-01-19 18:50:57 is 16201.088005584 s in the future
tar: ./src/provisioningserver/logger/tests: time stamp 2016-01-19 18:51:00 is 16204.087565162 s in the future
tar: ./src/provisioningserver/logger/__init__.py: time stamp 2016-01-19 18:50:57 is 16201.087051725 s in the future
tar: ./src/provisioningserver/logger/log.py: time stamp 2016-01-19 18:50:57 is 16201.086571345 s in the future
tar: ./src/provisioningserver/logger: time stamp 2016-01-19 18:51:00 is 16204.086104373 s in the future
tar: ./src/provisioningserver/events.py: time stamp 2016-01-19 18:50:57 is 16201.085656407 s in the future
tar: ./src/provisioningserver/diskless.py: time stamp 2016-01-19 18:50:57 is 16201.085236686 s in the future
tar: ./src/provisioningserver: time stamp 2016-01-19 18:51:00 is 16204.084887981 s in the future
tar: ./examples/network-vlan.yaml: time stamp 2016-01-19 18:51:47 is 16251.084436597 s in the future
tar: ./examples/network-bridge.yaml: time stamp 2016-01-19 18:51:47 is 16251.084044426 s in the future
tar: ./examples/network-all.yaml: time stamp 2016-01-19 18:51:47 is 16251.083642305 s in the future
tar: ./examples/tests/allindata.yaml: time stamp 2016-01-19 18:51:47 is 16251.08319801 s in the future
tar: ./examples/tests/mdadm_bcache.yaml: time stamp 2016-01-19 18:51:47 is 16251.08277818 s in the future
tar: ./examples/tests/raid6boot.yaml: time stamp 2016-01-19 18:51:47 is 16251.082394763 s in the future
tar: ./examples/tests/raid5bcache.yaml: time stamp 2016-01-19 18:51:47 is 16251.081980103 s in the future
tar: ./examples/tests/raid5boot.yaml: time stamp 2016-01-19 18:51:47 is 16251.08156747 s in the future
tar: ./examples/tests/basic.yaml: time stamp 2016-01-19 18:51:47 is 16251.081142701 s in the future
tar: ./examples/tests/raid10boot.yaml: time stamp 2016-01-19 18:51:47 is 16251.029399766 s in the future
tar: ./examples/tests/bonding_network.yaml: time stamp 2016-01-19 18:51:47 is 16251.028921647 s in the future
tar: ./examples/tests/basic_network.yaml: time stamp 2016-01-19 18:51:47 is 16251.028486793 s in the future
tar: ./examples/tests/lvm.yaml: time stamp 2016-01-19 18:51:47 is 16251.028061905 s in the future
tar: ./examples/tests/mirrorboot.yaml: time stamp 2016-01-19 18:51:47 is 16251.027663439 s in the future
tar: ./examples/tests/bcache_basic.yaml: time stamp 2016-01-19 18:51:47 is 16251.02720389 s in the future
tar: ./examples/tests: time stamp 2016-01-19 18:51:47 is 16251.026818451 s in the future
tar: ./examples/partitioning-demos/custom-partitioning-demo-gpt.yaml: time stamp 2016-01-19 18:51:47 is 16251.026334785 s in the future
tar: ./examples/partitioning-demos/custom-partitioning-demo-lvm.yaml: time stamp 2016-01-19 18:51:47 is 16251.025917785 s in the future
tar: ./examples/partitioning-demos/custom-partitioning-demo-bcache.yaml: time stamp 2016-01-19 18:51:47 is 16251.025470121 s in the future
tar: ./examples/partitioning-demos/custom-partitioning-demo.yaml: time stamp 2016-01-19 18:51:47 is 16251.025058325 s in the future
tar: ./examples/partitioning-demos/custom-partitioning-demo-raid.yaml: time stamp 2016-01-19 18:51:47 is 16251.024623235 s in the future
tar: ./examples/partitioning-demos/custom-partitioning-demo-dmcrypt.yaml: time stamp 2016-01-19 18:51:47 is 16251.024214242 s in the future
tar: ./examples/partitioning-demos: time stamp 2016-01-19 18:51:47 is 16251.02377737 s in the future
tar: ./examples/basic.yaml: time stamp 2016-01-19 18:51:47 is 16251.023387819 s in the future
tar: ./examples/finalize.windows: time stamp 2016-01-19 18:51:47 is 16251.022808679 s in the future
tar: ./examples/network-bond.yaml: time stamp 2016-01-19 18:51:47 is 16251.022364284 s in the future
tar: ./examples/network-simple.yaml: time stamp 2016-01-19 18:51:47 is 16251.021891388 s in the future
tar: ./examples: time stamp 2016-01-19 18:51:47 is 16251.021552809 s in the future
tar: ./.idea/modules.xml: time stamp 2016-01-19 18:50:57 is 16201.021099756 s in the future
tar: ./.idea/maas.iml: time stamp 2016-01-19 18:50:57 is 16201.020701884 s in the future
tar: ./.idea/sqldialects.xml: time stamp 2016-01-19 18:50:57 is 16201.020295128 s in the future
tar: ./.idea/encodings.xml: time stamp 2016-01-19 18:50:57 is 16201.019916994 s in the future
tar: ./.idea/misc.xml: time stamp 2016-01-19 18:50:57 is 16201.019512865 s in the future
tar: ./.idea/inspectionProfiles/Project_Default.xml: time stamp 2016-01-19 18:50:57 is 16201.019064897 s in the future
tar: ./.idea/inspectionProfiles/profiles_settings.xml: time stamp 2016-01-19 18:50:57 is 16201.018608352 s in the future
tar: ./.idea/inspectionProfiles: time stamp 2016-01-19 18:50:59 is 16203.018230549 s in the future
tar: ./.idea/codeStyleSettings.xml: time stamp 2016-01-19 18:50:57 is 16201.017666256 s in the future
tar: ./.idea: time stamp 2016-01-19 18:51:00 is 16204.017036745 s in the future
tar: ./tools/write-curtin: time stamp 2016-01-19 18:51:47 is 16251.016383586 s in the future
tar: ./tools/launch: time stamp 2016-01-19 18:51:47 is 16251.015736004 s in the future
tar: ./tools/report-webhook-logger: time stamp 2016-01-19 18:51:47 is 16251.015194686 s in the future
tar: ./tools/build-deb: time stamp 2016-01-19 18:51:47 is 16251.014507665 s in the future
tar: ./tools/vmtest-system-setup: time stamp 2016-01-19 18:51:47 is 16251.01367633 s in the future
tar: ./tools/jenkins-runner: time stamp 2016-01-19 18:51:47 is 16251.013001731 s in the future
tar: ./tools/maas2roottar: time stamp 2016-01-19 18:51:47 is 16251.012160271 s in the future
tar: ./tools/tox-venv: time stamp 2016-01-19 18:51:47 is 16251.011295521 s in the future
tar: ./tools/xkvm: time stamp 2016-01-19 18:51:47 is 16251.010511233 s in the future
tar: ./tools/ssh-keys-list: time stamp 2016-01-19 18:51:47 is 16251.009745013 s in the future
tar: ./tools/usquery: time stamp 2016-01-19 18:51:47 is 16251.009162388 s in the future
tar: ./tools/run-pyflakes3: time stamp 2016-01-19 18:51:47 is 16251.008610718 s in the future
tar: ./tools/export-tarball: time stamp 2016-01-19 18:51:47 is 16251.00803107 s in the future
tar: ./tools/noproxy: time stamp 2016-01-19 18:51:47 is 16251.00746528 s in the future
tar: ./tools/vmtest-sync-images: time stamp 2016-01-19 18:51:47 is 16251.006892525 s in the future
tar: ./tools/run-pyflakes: time stamp 2016-01-19 18:51:47 is 16251.006374551 s in the future
tar: ./tools/run-pep8: time stamp 2016-01-19 18:51:47 is 16251.005845069 s in the future
tar: ./tools: time stamp 2016-01-19 18:51:47 is 16251.005383253 s in the future
tar: ./required-packages/trusty: time stamp 2016-01-19 18:50:57 is 16201.004865024 s in the future
tar: ./required-packages/dev: time stamp 2016-01-19 18:50:57 is 16201.004359541 s in the future
tar: ./required-packages/doc: time stamp 2016-01-19 18:50:57 is 16201.003812131 s in the future
tar: ./required-packages/vivid: time stamp 2016-01-19 18:50:57 is 16201.003236518 s in the future
tar: ./required-packages/build: time stamp 2016-01-19 18:50:57 is 16201.002685228 s in the future
tar: ./required-packages/wily: time stamp 2016-01-19 18:50:57 is 16201.002141989 s in the future
tar: ./required-packages/optional: time stamp 2016-01-19 18:50:57 is 16201.001648374 s in the future
tar: ./required-packages/base: time stamp 2016-01-19 18:50:57 is 16201.001233476 s in the future
tar: ./required-packages/forbidden: time stamp 2016-01-19 18:50:57 is 16201.000709077 s in the future
tar: ./required-packages/utopic: time stamp 2016-01-19 18:50:57 is 16201.000165138 s in the future
tar: ./required-packages: time stamp 2016-01-19 18:51:00 is 16203.999638927 s in the future
tar: ./test-requirements.txt: time stamp 2016-01-19 18:51:47 is 16250.999068244 s in the future
tar: ./README: time stamp 2016-01-19 18:50:57 is 16200.998486674 s in the future
tar: ./utilities/normalize-spelling: time stamp 2016-01-19 18:50:57 is 16200.997858891 s in the future
tar: ./utilities/rewrite-future-imports: time stamp 2016-01-19 18:50:57 is 16200.997295251 s in the future
tar: ./utilities/find-imported-module-files: time stamp 2016-01-19 18:50:57 is 16200.996743021 s in the future
tar: ./utilities/format-new-and-modified-imports: time stamp 2016-01-19 18:50:57 is 16200.996104015 s in the future
tar: ./utilities/remote-reinstall: time stamp 2016-01-19 18:50:57 is 16200.995560999 s in the future
tar: ./utilities/find-intermittent-errors: time stamp 2016-01-19 18:50:57 is 16200.995014691 s in the future
tar: ./utilities/introspect: time stamp 2016-01-19 18:50:57 is 16200.994445026 s in the future
tar: ./utilities/python_standard_libs.py: time stamp 2016-01-19 18:50:57 is 16200.993808556 s in the future
tar: ./utilities/doc-lint: time stamp 2016-01-19 18:50:57 is 16200.993234011 s in the future
tar: ./utilities/maas-region-support-dump: time stamp 2016-01-19 18:50:57 is 16200.992674673 s in the future
tar: ./utilities/configure-buildout: time stamp 2016-01-19 18:50:57 is 16200.99225285 s in the future
tar: ./utilities/generate-and-upload-docs: time stamp 2016-01-19 18:50:57 is 16200.99168065 s in the future
tar: ./utilities/format-imports: time stamp 2016-01-19 18:50:57 is 16200.991167318 s in the future
tar: ./utilities/find-imported-modules: time stamp 2016-01-19 18:50:57 is 16200.990694627 s in the future
tar: ./utilities/check-maaslog-exception: time stamp 2016-01-19 18:50:57 is 16200.990296554 s in the future
tar: ./utilities: time stamp 2016-01-19 18:51:00 is 16203.989880561 s in the future
tar: ./LICENSE: time stamp 2016-01-19 18:50:57 is 16200.989186745 s in the future
tar: ./contrib/maas-rsyslog.conf: time stamp 2016-01-19 18:50:57 is 16200.988571019 s in the future
tar: ./contrib/maas-http.conf: time stamp 2016-01-19 18:50:57 is 16200.98797553 s in the future
tar: ./contrib/tgt.conf: time stamp 2016-01-19 18:50:57 is 16200.987414127 s in the future
tar: ./contrib/preseeds_v2/preseed_master: time stamp 2016-01-19 18:50:57 is 16200.986816953 s in the future
tar: ./contrib/preseeds_v2/commissioning: time stamp 2016-01-19 18:50:57 is 16200.986253635 s in the future
tar: ./contrib/preseeds_v2/generic: time stamp 2016-01-19 18:50:57 is 16200.985657989 s in the future
tar: ./contrib/preseeds_v2/preseed_master_windows_amd64_generic_win2012: time stamp 2016-01-19 18:50:57 is 16200.985100801 s in the future
tar: ./contrib/preseeds_v2/curtin: time stamp 2016-01-19 18:50:57 is 16200.984554382 s in the future
tar: ./contrib/preseeds_v2/enlist_userdata: time stamp 2016-01-19 18:50:57 is 16200.984002551 s in the future
tar: ./contrib/preseeds_v2/preseed_master_windows_amd64_generic_win2012hv: time stamp 2016-01-19 18:50:57 is 16200.983429272 s in the future
tar: ./contrib/preseeds_v2/enlist: time stamp 2016-01-19 18:50:57 is 16200.982916632 s in the future
tar: ./contrib/preseeds_v2/curtin_userdata: time stamp 2016-01-19 18:50:57 is 16200.982320368 s in the future
tar: ./contrib/preseeds_v2/curtin_userdata_centos: time stamp 2016-01-19 18:50:57 is 16200.98174654 s in the future
tar: ./contrib/preseeds_v2/curtin_userdata_custom: time stamp 2016-01-19 18:50:57 is 16200.98118908 s in the future
tar: ./contrib/preseeds_v2/preseed_master_windows_amd64_generic_win2012r2: time stamp 2016-01-19 18:50:57 is 16200.9806279 s in the future
tar: ./contrib/preseeds_v2/curtin_userdata_suse: time stamp 2016-01-19 18:50:57 is 16200.980071149 s in the future
tar: ./contrib/preseeds_v2/curtin_userdata_windows: time stamp 2016-01-19 18:50:57 is 16200.979521083 s in the future
tar: ./contrib/preseeds_v2/preseed_master_windows_amd64_generic_win2012hvr2: time stamp 2016-01-19 18:50:57 is 16200.934864974 s in the future
tar: ./contrib/preseeds_v2: time stamp 2016-01-19 18:51:00 is 16203.934249273 s in the future
tar: ./contrib: time stamp 2016-01-19 18:51:00 is 16203.933476747 s in the future
tar: ./templates/model.py: time stamp 2016-01-19 18:50:57 is 16200.932717846 s in the future
tar: ./templates/test_module.js: time stamp 2016-01-19 18:50:57 is 16200.932103128 s in the future
tar: ./templates/module.py: time stamp 2016-01-19 18:50:57 is 16200.931605603 s in the future
tar: ./templates/script.py: time stamp 2016-01-19 18:50:57 is 16200.931116127 s in the future
tar: ./templates/test_module.py: time stamp 2016-01-19 18:50:57 is 16200.930462255 s in the future
tar: ./templates/management_command.py: time stamp 2016-01-19 18:50:57 is 16200.929460752 s in the future
tar: ./templates/module.js: time stamp 2016-01-19 18:50:57 is 16200.928618849 s in the future
tar: ./templates/doc.txt: time stamp 2016-01-19 18:50:57 is 16200.927561041 s in the future
tar: ./templates/test_module.html: time stamp 2016-01-19 18:50:57 is 16200.926776216 s in the future
tar: ./templates/script.sh: time stamp 2016-01-19 18:50:57 is 16200.926173602 s in the future
tar: ./templates/README: time stamp 2016-01-19 18:50:57 is 16200.925601423 s in the future
tar: ./templates: time stamp 2016-01-19 18:51:00 is 16203.925079471 s in the future
tar: ./versions.cfg: time stamp 2016-01-19 18:50:57 is 16200.92453606 s in the future
tar: ./INSTALL.txt: time stamp 2016-01-19 18:50:57 is 16200.923963955 s in the future
tar: ./run-e2e/etc/maas/templates: time stamp 2016-01-19 18:50:56 is 16199.923420094 s in the future
tar: ./run-e2e/etc/maas/drivers.yaml: time stamp 2016-01-19 18:50:56 is 16199.922889402 s in the future
tar: ./docs/hacking.rst: time stamp 2016-01-19 18:50:56 is 16199.922136294 s in the future
tar: ./docs/install.rst: time stamp 2016-01-19 18:50:56 is 16199.921363933 s in the future
tar: ./run/etc/maas/templates: time stamp 2016-01-19 18:50:56 is 16199.920633014 s in the future
tar: ./run/etc/maas/drivers.yaml: time stamp 2016-01-19 18:50:56 is 16199.919848931 s in the future
tar: ./services/regiond2/run: time stamp 2016-01-19 18:50:56 is 16199.919205666 s in the future
tar: ./run-e2e/etc/maas: time stamp 2016-01-19 18:50:56 is 16199.918693667 s in the future
tar: ./run-e2e/etc: time stamp 2016-01-19 18:50:56 is 16199.918239963 s in the future
tar: ./run-e2e: time stamp 2016-01-19 18:50:56 is 16199.917741318 s in the future
tar: ./docs: time stamp 2016-01-19 18:51:00 is 16203.917073134 s in the future
tar: ./run/etc/maas: time stamp 2016-01-19 18:50:56 is 16199.916540972 s in the future
tar: ./run/etc: time stamp 2016-01-19 18:50:56 is 16199.916122714 s in the future
tar: ./run: time stamp 2016-01-19 18:50:56 is 16199.91560121 s in the future
tar: ./services/regiond2: time stamp 2016-01-19 18:50:59 is 16202.915124074 s in the future
tar: ./services: time stamp 2016-01-19 18:51:00 is 16203.914602875 s in the future
adt-virt-qemu: DBG:  +<?
adt-run: DBG: got reply from testbed: ok
adt-run: DBG: testbed command ['chown', '-R', 'ubuntu', '--', '/tmp/adt-run.rX7fFx/build.lEp/real-tree'], kind short, sout raw, serr pipe, env ['LANG=C.UTF-8']
adt-run: DBG: testbed command exited with code 0
adt-run [19:20:58]: test maas-package-test: [-----------------------
adt-run: DBG: testbed command ['su', '-s', '/bin/bash', 'root', '-c', 'set -e; export USER=`id -nu`; . /etc/profile >/dev/null 2>&1 || true;  . ~/.profile >/dev/null 2>&1 || true; buildtree="/tmp/adt-run.rX7fFx/build.lEp/real-tree"; mkdir -p -m 1777 -- "/tmp/adt-run.rX7fFx/maas-package-test-artifacts"; export ADT_ARTIFACTS="/tmp/adt-run.rX7fFx/maas-package-test-artifacts"; export ADTTMP=$(mktemp -d --tmpdir adttmp.XXXXXX); rm -f /tmp/adt_test_script_pid; set -C; echo $$ > /tmp/adt_test_script_pid; set +C; trap "rm -rf $ADTTMP /tmp/adt_test_script_pid" EXIT INT QUIT PIPE; chmod 755 $ADTTMP; cd "$buildtree"; export LANG=C.UTF-8; unset LANGUAGE LC_CTYPE LC_NUMERIC LC_TIME LC_COLLATE LC_MONETARY LC_MESSAGES LC_PAPER LC_NAME LC_ADDRESS LC_TELEPHONE LC_MEASUREMENT LC_IDENTIFICATION LC_ALL;chmod +x /tmp/adt-run.rX7fFx/build.lEp/real-tree/debian/tests/maas-package-test; touch /tmp/adt-run.rX7fFx/maas-package-test-stdout /tmp/adt-run.rX7fFx/maas-package-test-stderr; /tmp/adt-run.rX7fFx/build.lEp/real-tree/debian/tests/maas-package-test 2> >(tee -a /tmp/adt-run.rX7fFx/maas-package-test-stderr >&2) > >(tee -a /tmp/adt-run.rX7fFx/maas-package-test-stdout); '], kind test, sout raw, serr raw, env ['LANG=C.UTF-8']
maas-integration.TestMAASIntegration.test_create_admin ... ok
maas-integration.TestMAASIntegration.test_restart_dbus_avahi ... SKIP: Avahi/DBUS are not used anymore
maas-integration.TestMAASIntegration.test_update_maas_url_old ... SKIP: maas_local_settings.py is not used anymore
maas-integration.TestMAASIntegration.test_update_maas_url ... ok
maas-integration.TestMAASIntegration.test_restart_provisioning_server ... ok
maas-integration.TestMAASIntegration.test_check_initial_services ... ok
maas-integration.TestMAASIntegration.test_check_rpc_info ... ok
maas-integration.TestMAASIntegration.test_update_preseed_arm ... ok
maas-integration.TestMAASIntegration.test_login_api ... FAIL
SKIP: Not testing Cluster controller

======================================================================
FAIL: maas-integration.TestMAASIntegration.test_login_api
----------------------------------------------------------------------
_StringException: Empty attachments:
  ['maas', 'login', 'maas', 'http://10.245.136.6/MAAS/api/1.0/', u'LNEDn8AUjbkgttju7s:2ESZtD7pnywfDXfWrp:7h6HJdD5Enbykt2sVrk45TLqdq3w4tK8'] stdout

['maas', 'login', 'maas', 'http://10.245.136.6/MAAS/api/1.0/', u'LNEDn8AUjbkgttju7s:2ESZtD7pnywfDXfWrp:7h6HJdD5Enbykt2sVrk45TLqdq3w4tK8'] stderr: {{{The MAAS server gave an unexpected response: 503}}}

Traceback (most recent call last):
  File "/tmp/adt-run.rX7fFx/build.lEp/real-tree/debian/tests/maas-integration.py", line 542, in test_login_api
    assertCommandReturnCode(self, cmd, expected_output)
  File "/tmp/adt-run.rX7fFx/build.lEp/real-tree/debian/tests/utils.py", line 117, in assertCommandReturnCode
    runner.assertThat(output, Contains(expected_output))
  File "/usr/lib/python2.7/dist-packages/testtools/testcase.py", line 406, in assertThat
    raise mismatch_error
MismatchError: '\nYou are now logged in to the MAAS server' not in ''


----------------------------------------------------------------------
Ran 9 tests in 39.095s

FAILED (SKIP=3, failures=1)
adt-run: DBG: testbed command exited with code 1
adt-run [19:21:46]: test maas-package-test: -----------------------]
adt-run: DBG: testbed executing test finished with exit status 1
adt-run: DBG: sending command to testbed: copyup /tmp/adt-run.rX7fFx/maas-package-test-stdout /var/lib/jenkins/workspace/maas-trusty-1.9/results/maas-package-test-stdout
adt-virt-qemu: DBG: executing copyup /tmp/adt-run.rX7fFx/maas-package-test-stdout /var/lib/jenkins/workspace/maas-trusty-1.9/results/maas-package-test-stdout
adt-virt-qemu: DBG: ['cmdls', "(['/tmp/adt-virt-qemu.4dufpu21/runcmd', 'sh', '-ec', 'cat </tmp/adt-run.rX7fFx/maas-package-test-stdout'], ['cat'])"]
adt-virt-qemu: DBG: ['srcstdin', "<_io.TextIOWrapper name='/dev/null' mode='r' encoding='ANSI_X3.4-1968'>", 'deststdout', "<_io.TextIOWrapper name='/var/lib/jenkins/workspace/maas-trusty-1.9/results/maas-package-test-stdout' mode='w' encoding='ANSI_X3.4-1968'>", 'devnull_read', <_io.TextIOWrapper name='/dev/null' mode='r' encoding='ANSI_X3.4-1968'>]
adt-virt-qemu: DBG:  +< /tmp/adt-virt-qemu.4dufpu21/runcmd sh -ec cat </tmp/adt-run.rX7fFx/maas-package-test-stdout
adt-virt-qemu: DBG:  +> cat
adt-virt-qemu: DBG:  +>?
adt-virt-qemu: DBG:  +<?
adt-run: DBG: got reply from testbed: ok
adt-run: DBG: sending command to testbed: copyup /tmp/adt-run.rX7fFx/maas-package-test-stderr /var/lib/jenkins/workspace/maas-trusty-1.9/results/maas-package-test-stderr
adt-virt-qemu: DBG: executing copyup /tmp/adt-run.rX7fFx/maas-package-test-stderr /var/lib/jenkins/workspace/maas-trusty-1.9/results/maas-package-test-stderr
adt-virt-qemu: DBG: ['cmdls', "(['/tmp/adt-virt-qemu.4dufpu21/runcmd', 'sh', '-ec', 'cat </tmp/adt-run.rX7fFx/maas-package-test-stderr'], ['cat'])"]
adt-virt-qemu: DBG: ['srcstdin', "<_io.TextIOWrapper name='/dev/null' mode='r' encoding='ANSI_X3.4-1968'>", 'deststdout', "<_io.TextIOWrapper name='/var/lib/jenkins/workspace/maas-trusty-1.9/results/maas-package-test-stderr' mode='w' encoding='ANSI_X3.4-1968'>", 'devnull_read', <_io.TextIOWrapper name='/dev/null' mode='r' encoding='ANSI_X3.4-1968'>]
adt-virt-qemu: DBG:  +< /tmp/adt-virt-qemu.4dufpu21/runcmd sh -ec cat </tmp/adt-run.rX7fFx/maas-package-test-stderr
adt-virt-qemu: DBG:  +> cat
adt-virt-qemu: DBG:  +>?
adt-virt-qemu: DBG:  +<?
adt-run: DBG: got reply from testbed: ok
adt-run [19:21:47]: test maas-package-test:  - - - - - - - - - - results - - - - - - - - - -
maas-package-test    FAIL non-zero exit status 1
adt-run: DBG: sending command to testbed: copyup /tmp/adt-run.rX7fFx/maas-package-test-artifacts/ /var/lib/jenkins/workspace/maas-trusty-1.9/results/artifacts/
adt-virt-qemu: DBG: executing copyup /tmp/adt-run.rX7fFx/maas-package-test-artifacts/ /var/lib/jenkins/workspace/maas-trusty-1.9/results/artifacts/
adt-virt-qemu: DBG: ['cmdls', "(['/tmp/adt-virt-qemu.4dufpu21/runcmd', 'sh', '-ec', 'cd /tmp/adt-run.rX7fFx/maas-package-test-artifacts/; tar -c . -f -'], ['tar', '--directory', '/var/lib/jenkins/workspace/maas-trusty-1.9/results/artifacts/', '--preserve-permissions', '--extract', '--no-same-owner', '-f', '-'])"]
adt-virt-qemu: DBG: ['srcstdin', "<_io.TextIOWrapper name='/dev/null' mode='r' encoding='ANSI_X3.4-1968'>", 'deststdout', "<_io.TextIOWrapper name='/dev/null' mode='r' encoding='ANSI_X3.4-1968'>", 'devnull_read', <_io.TextIOWrapper name='/dev/null' mode='r' encoding='ANSI_X3.4-1968'>]
adt-virt-qemu: DBG:  +< /tmp/adt-virt-qemu.4dufpu21/runcmd sh -ec cd /tmp/adt-run.rX7fFx/maas-package-test-artifacts/; tar -c . -f -
adt-virt-qemu: DBG:  +> tar --directory /var/lib/jenkins/workspace/maas-trusty-1.9/results/artifacts/ --preserve-permissions --extract --no-same-owner -f -
adt-virt-qemu: DBG:  +>?
adt-virt-qemu: DBG:  +<?
adt-run: DBG: got reply from testbed: ok
adt-run: DBG: testbed command ['rm', '-rf', '/tmp/adt-run.rX7fFx/maas-package-test-artifacts'], kind short, sout raw, serr pipe, env ['LANG=C.UTF-8']
adt-run: DBG: testbed command exited with code 0
adt-run: DBG: no need to restore click AppArmor profiles
adt-run: DBG: needs_reset, previously=False, requested by run_tests() line 1292
adt-run: DBG: testbed stop
adt-run: DBG: testbed close, scratch=/tmp/adt-run.rX7fFx
adt-run: DBG: sending command to testbed: close
adt-virt-qemu: DBG: executing close
adt-virt-qemu: DBG: cleanup...
qemu: terminating on signal 15 from pid 16959
adt-run: DBG: got reply from testbed: ok
adt-run: DBG: sending command to testbed: quit
adt-virt-qemu: DBG: executing quit
adt-virt-qemu: DBG: cleanup...
adt-run: DBG: / tests-tree rmtree /var/lib/jenkins/workspace/maas-trusty-1.9/results/tests-tree
adt-run: DBG: / tests-tree rmtree /var/lib/jenkins/workspace/maas-trusty-1.9/results/tests-tree
Build step 'Execute shell' marked build as failure
Archiving artifacts
Email was triggered for: Failure - Any
Sending email for trigger: Failure - Any