DEBUG: Executing python function do_testimage
NOTE: rootfs file: TOPDIR/tmp/deploy/images/qemuppc/core-image-lsb-qemuppc.ext4
NOTE: Qemu log file: TOPDIR/tmp/work/qemuppc-poky-linux/core-image-lsb/1.0-r0/testimage/qemu_boot_log.20170806161208
NOTE: SSH log file: TOPDIR/tmp/work/qemuppc-poky-linux/core-image-lsb/1.0-r0/testimage/ssh_target_log.20170806161208
Created listening socket for qemu serial console on: 127.0.0.1:55157
NOTE: Created listening socket for qemu serial console on: 127.0.0.1:55157
Created listening socket for qemu serial console on: 127.0.0.1:54057
NOTE: Created listening socket for qemu serial console on: 127.0.0.1:54057
Not using kvm for runqemu
NOTE: Not using kvm for runqemu
launchcmd=runqemu snapshot tcpserial=54057 qemuppc TOPDIR/tmp/deploy/images/qemuppc/core-image-lsb-qemuppc.ext4 bootparams="console=tty0,115200n8 printk.time=1" qemuparams="-serial tcp:127.0.0.1:55157"
NOTE: launchcmd=runqemu snapshot tcpserial=54057 qemuppc TOPDIR/tmp/deploy/images/qemuppc/core-image-lsb-qemuppc.ext4 bootparams="console=tty0,115200n8 printk.time=1" qemuparams="-serial tcp:127.0.0.1:55157"
runqemu started, pid is 30571
NOTE: runqemu started, pid is 30571
waiting at most 60 seconds for qemu pid
NOTE: waiting at most 60 seconds for qemu pid
qemu started - qemu procces pid is 30599
NOTE: qemu started - qemu procces pid is 30599
qemu cmdline used:
TOPDIR/tmp/sysroots/x86_64-linux/usr/bin/qemu-system-ppc-netdevtap,id=net0,ifname=tap0,script=no,downscript=no-devicevirtio-net-pci,netdev=net0,mac=52:54:00:12:34:02-serialtcp:127.0.0.1:55157-machinemac99-cpuG4-m256-serialtcp:127.0.0.1:54057-drivefile=TOPDIR/tmp/deploy/images/qemuppc/core-image-lsb-qemuppc.ext4,if=virtio,format=raw-show-cursor-usb-usbdevicetablet-devicevirtio-rng-pci-snapshot-kernelTOPDIR/tmp/deploy/images/qemuppc/vmlinux-appendroot=/dev/vda rw highres=off console=tty0,115200n8 printk.time=1 mem=256M ip=192.168.7.2::192.168.7.1:255.255.255.0 console=tty console=ttyS0
NOTE: qemu cmdline used:
TOPDIR/tmp/sysroots/x86_64-linux/usr/bin/qemu-system-ppc-netdevtap,id=net0,ifname=tap0,script=no,downscript=no-devicevirtio-net-pci,netdev=net0,mac=52:54:00:12:34:02-serialtcp:127.0.0.1:55157-machinemac99-cpuG4-m256-serialtcp:127.0.0.1:54057-drivefile=TOPDIR/tmp/deploy/images/qemuppc/core-image-lsb-qemuppc.ext4,if=virtio,format=raw-show-cursor-usb-usbdevicetablet-devicevirtio-rng-pci-snapshot-kernelTOPDIR/tmp/deploy/images/qemuppc/vmlinux-appendroot=/dev/vda rw highres=off console=tty0,115200n8 printk.time=1 mem=256M ip=192.168.7.2::192.168.7.1:255.255.255.0 console=tty console=ttyS0
Target IP: 192.168.7.2
NOTE: Target IP: 192.168.7.2
Server IP: 192.168.7.1
NOTE: Server IP: 192.168.7.1
Starting logging thread
NOTE: Starting logging thread
Starting thread event loop
NOTE: Starting thread event loop
Connection request received
NOTE: Connection request received
Setting connection established event
NOTE: Setting connection established event
Output from runqemu:
runqemu - INFO - MACHINE: qemuppc
runqemu - INFO - DEPLOY_DIR_IMAGE: TOPDIR/tmp/deploy/images/qemuppc
runqemu - INFO - CONFFILE: TOPDIR/tmp/deploy/images/qemuppc/core-image-lsb-qemuppc.qemuboot.conf
runqemu - INFO - Continuing with the following parameters:
stty: 'standard input': Inappropriate ioctl for device
runqemu - INFO - Running /usr/sbin/ip link...
runqemu - INFO - Acquiring lockfile /tmp/qemu-tap-locks/tap0.lock...
runqemu - INFO - Using preconfigured tap device tap0
runqemu - INFO - If this is not intended, touch /tmp/qemu-tap-locks/tap0.skip to make runqemu skip tap0.
runqemu - INFO - Running ldd TOPDIR/tmp/sysroots/x86_64-linux/usr/bin/qemu-system-ppc...
runqemu - INFO - Running TOPDIR/tmp/sysroots/x86_64-linux/usr/bin/qemu-system-ppc -netdev tap,id=net0,ifname=tap0,script=no,downscript=no -device virtio-net-pci,netdev=net0,mac=52:54:00:12:34:02 -serial tcp:127.0.0.1:55157 -machine mac99 -cpu G4 -m 256 -serial tcp:127.0.0.1:54057 -drive file=TOPDIR/tmp/deploy/images/qemuppc/core-image-lsb-qemuppc.ext4,if=virtio,format=raw -show-cursor -usb -usbdevice tablet -device virtio-rng-pci -snapshot -kernel TOPDIR/tmp/deploy/images/qemuppc/vmlinux -append 'root=/dev/vda rw highres=off console=tty0,115200n8 printk.time=1 mem=256M ip=192.168.7.2::192.168.7.1:255.255.255.0 console=tty console=ttyS0'
NOTE: Output from runqemu:
runqemu - INFO - MACHINE: qemuppc
runqemu - INFO - DEPLOY_DIR_IMAGE: TOPDIR/tmp/deploy/images/qemuppc
runqemu - INFO - CONFFILE: TOPDIR/tmp/deploy/images/qemuppc/core-image-lsb-qemuppc.qemuboot.conf
runqemu - INFO - Continuing with the following parameters:
stty: 'standard input': Inappropriate ioctl for device
runqemu - INFO - Running /usr/sbin/ip link...
runqemu - INFO - Acquiring lockfile /tmp/qemu-tap-locks/tap0.lock...
runqemu - INFO - Using preconfigured tap device tap0
runqemu - INFO - If this is not intended, touch /tmp/qemu-tap-locks/tap0.skip to make runqemu skip tap0.
runqemu - INFO - Running ldd TOPDIR/tmp/sysroots/x86_64-linux/usr/bin/qemu-system-ppc...
runqemu - INFO - Running TOPDIR/tmp/sysroots/x86_64-linux/usr/bin/qemu-system-ppc -netdev tap,id=net0,ifname=tap0,script=no,downscript=no -device virtio-net-pci,netdev=net0,mac=52:54:00:12:34:02 -serial tcp:127.0.0.1:55157 -machine mac99 -cpu G4 -m 256 -serial tcp:127.0.0.1:54057 -drive file=TOPDIR/tmp/deploy/images/qemuppc/core-image-lsb-qemuppc.ext4,if=virtio,format=raw -show-cursor -usb -usbdevice tablet -device virtio-rng-pci -snapshot -kernel TOPDIR/tmp/deploy/images/qemuppc/vmlinux -append 'root=/dev/vda rw highres=off console=tty0,115200n8 printk.time=1 mem=256M ip=192.168.7.2::192.168.7.1:255.255.255.0 console=tty console=ttyS0'
Waiting at most 1500 seconds for login banner
NOTE: Waiting at most 1500 seconds for login banner
Connection from 127.0.0.1:32828
NOTE: Connection from 127.0.0.1:32828
Reached login banner
NOTE: Reached login banner
Logged as root in serial console
NOTE: Logged as root in serial console
NOTE: Test modules ['oeqa.runtime.ping', 'oeqa.runtime.ssh', 'oeqa.runtime.df', 'oeqa.runtime.date', 'oeqa.runtime.scp', 'oeqa.runtime.syslog', 'oeqa.runtime.pam', 'oeqa.runtime.parselogs', 'oeqa.runtime.smart', 'oeqa.runtime.rpm']
NOTE: Found 38 tests
test_ping (oeqa.runtime.ping.PingTest) ... ok
test_syslog_running (oeqa.runtime.syslog.SyslogTest) ... ok
test_syslog_logger (oeqa.runtime.syslog.SyslogTestConfig) ... ok
test_syslog_restart (oeqa.runtime.syslog.SyslogTestConfig) ... ok
test_syslog_startup_config (oeqa.runtime.syslog.SyslogTestConfig) ... skipped 'Non-busybox syslog'
test_ssh (oeqa.runtime.ssh.SshTest) ... ok
test_df (oeqa.runtime.df.DfTest) ... ok
test_date (oeqa.runtime.date.DateTest) ... ok
test_scp_file (oeqa.runtime.scp.ScpTest) ... ok
test_pam (oeqa.runtime.pam.PamBasicTest) ... ok
test_parselogs (oeqa.runtime.parselogs.ParseLogsTest) ... FAIL
test_smart_help (oeqa.runtime.smart.SmartBasicTest) ... ok
test_smart_info (oeqa.runtime.smart.SmartBasicTest) ... ok
test_smart_query (oeqa.runtime.smart.SmartBasicTest) ... ok
test_smart_search (oeqa.runtime.smart.SmartBasicTest) ... ok
test_smart_stats (oeqa.runtime.smart.SmartBasicTest) ... ok
test_smart_version (oeqa.runtime.smart.SmartBasicTest) ... ok
Machine information:
*******************************
Machine name: qemuppc
CPU:
Arch: ppc
Physical cores:
Logical cores: 1
*******************************
NOTE: Executing 'TOPDIR/tmp/sysroots/x86_64-linux/usr/bin/createrepo --dbpath TOPDIR/tmp/work/qemuppc-poky-linux/core-image-lsb/1.0-r0/rpmdb/all --update -q TOPDIR/tmp/work/qemuppc-poky-linux/core-image-lsb/1.0-r0/rpm/all' ...
NOTE: Executing 'TOPDIR/tmp/sysroots/x86_64-linux/usr/bin/createrepo --dbpath TOPDIR/tmp/work/qemuppc-poky-linux/core-image-lsb/1.0-r0/rpmdb/ppc7400 --update -q TOPDIR/tmp/work/qemuppc-poky-linux/core-image-lsb/1.0-r0/rpm/ppc7400' ...
NOTE: Executing 'TOPDIR/tmp/sysroots/x86_64-linux/usr/bin/createrepo --dbpath TOPDIR/tmp/work/qemuppc-poky-linux/core-image-lsb/1.0-r0/rpmdb/qemuppc --update -q TOPDIR/tmp/work/qemuppc-poky-linux/core-image-lsb/1.0-r0/rpm/qemuppc' ...
NOTE: Previous repo file missing: TOPDIR/tmp/work/qemuppc-poky-linux/core-image-lsb/1.0-r0/rpm/all/repodata/primary.xml.gz
NOTE: Previous repo file missing: TOPDIR/tmp/work/qemuppc-poky-linux/core-image-lsb/1.0-r0/rpm/qemuppc/repodata/primary.xml.gz
NOTE: Previous repo file missing: TOPDIR/tmp/work/qemuppc-poky-linux/core-image-lsb/1.0-r0/rpm/ppc7400/repodata/primary.xml.gz
test_smart_add_rpmdir (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_channel (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_channel_add (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_channel_help (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_channel_list (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_channel_rpmsys (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_channel_show (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_install (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_install_dependency (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_install_from_disk (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_install_from_http (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_local_dir (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_reinstall (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_remote_repo (oeqa.runtime.smart.SmartRepoTest) ... ok
test_smart_remove_package (oeqa.runtime.smart.SmartRepoTest) ... ok
test_rpm_help (oeqa.runtime.rpm.RpmBasicTest) ... ok
test_rpm_query (oeqa.runtime.rpm.RpmBasicTest) ... ok
test_check_rpm_install_removal_log_file_size (oeqa.runtime.rpm.RpmInstallRemoveTest) ... ok
test_rpm_install (oeqa.runtime.rpm.RpmInstallRemoveTest) ... ok
test_rpm_query_nonroot (oeqa.runtime.rpm.RpmInstallRemoveTest) ... ok
test_rpm_remove (oeqa.runtime.rpm.RpmInstallRemoveTest) ... ok
======================================================================
FAIL: test_parselogs (oeqa.runtime.parselogs.ParseLogsTest)
----------------------------------------------------------------------
Traceback (most recent call last):
File "/home/pokybuild/yocto-autobuilder/yocto-worker/nightly-ppc-lsb/build/meta/lib/oeqa/utils/decorators.py", line 109, in wrapped_f
return func(*args, **kwargs)
File "/home/pokybuild/yocto-autobuilder/yocto-worker/nightly-ppc-lsb/build/meta/lib/oeqa/utils/decorators.py", line 97, in wrapped_f
return f(*args, **kwargs)
File "/home/pokybuild/yocto-autobuilder/yocto-worker/nightly-ppc-lsb/build/meta/lib/oeqa/runtime/parselogs.py", line 313, in test_parselogs
self.assertEqual(errcount, 0, msg=self.msg)
AssertionError: 2 != 0 : Log: TOPDIR/tmp/work/qemuppc-poky-linux/core-image-lsb/1.0-r0/daemon.log
-----------------------
Central error: Aug 6 16:12:58 qemuppc bluetoothd[685]: Failed to access management interface
***********************
Aug 6 16:12:58 qemuppc bluetoothd[685]: Bluetooth daemon 5.41
Aug 6 16:12:58 qemuppc bluetoothd[685]: Failed to access management interface
Aug 6 16:12:58 qemuppc bluetoothd[685]: Adapter handling initialization failed
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/chargen-dgram [file=/etc/xinetd.conf] [line=11]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/chargen-stream [file=/etc/xinetd.d/chargen-stream] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/daytime-dgram [file=/etc/xinetd.d/daytime-dgram] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/daytime-stream [file=/etc/xinetd.d/daytime-stream] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/discard-dgram [file=/etc/xinetd.d/discard-dgram] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/discard-stream [file=/etc/xinetd.d/discard-stream] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/echo-dgram [file=/etc/xinetd.d/echo-dgram] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/echo-stream [file=/etc/xinetd.d/echo-stream] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/ftp-sensor [file=/etc/xinetd.d/ftp-sensor] [line=67]
***********************
Central error: Aug 6 16:12:58 qemuppc bluetoothd[685]: Adapter handling initialization failed
***********************
Aug 6 16:12:58 qemuppc bluetoothd[685]: Bluetooth daemon 5.41
Aug 6 16:12:58 qemuppc bluetoothd[685]: Failed to access management interface
Aug 6 16:12:58 qemuppc bluetoothd[685]: Adapter handling initialization failed
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/chargen-dgram [file=/etc/xinetd.conf] [line=11]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/chargen-stream [file=/etc/xinetd.d/chargen-stream] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/daytime-dgram [file=/etc/xinetd.d/daytime-dgram] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/daytime-stream [file=/etc/xinetd.d/daytime-stream] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/discard-dgram [file=/etc/xinetd.d/discard-dgram] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/discard-stream [file=/etc/xinetd.d/discard-stream] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/echo-dgram [file=/etc/xinetd.d/echo-dgram] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/echo-stream [file=/etc/xinetd.d/echo-stream] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/ftp-sensor [file=/etc/xinetd.d/ftp-sensor] [line=67]
Aug 6 16:12:58 qemuppc xinetd[763]: Reading included configuration file: /etc/xinetd.d/tcpmux-server [file=/etc/xinetd.d/tcpmux-server] [line=70]
***********************
2 errors found in logs.
----------------------------------------------------------------------
Ran 38 tests in 696.649s
FAILED (failures=1, skipped=1)
ERROR: core-image-lsb - FAILED - check the task log and the ssh log
Stopping logging thread
NOTE: Stopping logging thread
Stop event received
NOTE: Stop event received
Tearing down logging thread
NOTE: Tearing down logging thread
Sending SIGTERM to runqemu
NOTE: Sending SIGTERM to runqemu
DEBUG: Python function do_testimage finished
ERROR: Function failed: do_testimage
