Testcase: test_edit_preset_must_update_preset

Build #:243:20140318:20140304
Arch:flo (Nexus 7 2013)
Release:trusty
Variant:touch
Artifacts
Console Log

Failure explanation

This test failure has not yet been categorized.
Log in to edit.

Test case data

testcase
test_edit_preset_must_update_preset
testsuite
ubuntu_clock_app.tests.test_timer.TestTimer
returncode
1
command
autopilot
stderr
_StringException: /var/log/syslog: {{{
Mar 18 12:03:31 ubuntu-phablet kernel: [  177.162628] init: sys_prop: mis-match msg size received: 0 expected: 128 errno: 4
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.492309] bq27541_get_psp status: Charging ret= 0x0101
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.492919] bq27541_get_psp status: Charging ret= 0x0101
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.493591] bq27541_get_psp voltage_now= 4110000 uV
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.494873] bq27541_get_capacity = 89% ret= 88
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.495422] bq27541_get_psp temperature= 215 (0.1¢XC)
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.496826] bq27541_get_psp current = -322 mA
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.497985] bq27541_get_psp status: Charging ret= 0x0101
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.498748] bq27541_get_capacity check capacity, cap = 4110, smb_retry = 0
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.499145] bq27541_get_psp voltage_now= 4110000 uV
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.499847] bq27541_get_capacity = 89% ret= 88
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.500335] bq27541_get_capacity = 100% ret= 100
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.501037] bq27541_get_psp voltage_now= 2945000 uV
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.501525] bq27541_get_psp error: temperature ret=4110, old_temp=215 
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.501525] bq27541_get_psp temperature= 215 (0.1¢XC)
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.504302] bq27541_get_psp current = -322 mA
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.504821] bq27541_get_psp current = 780 mA
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.505889] bq27541_get_psp error: temperature ret=257, old_temp=215 
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.505889] bq27541_get_psp temperature= 215 (0.1¢XC)
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.506378] bq27541_get_psp status: Full ret= 0x0d63
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.507720] bq27541_get_psp status: Full ret= 0x1003
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.508209] healthd: battery l=89 v=2945 t=21.5 h=2 st=5 c=0 chg=u
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.508605] bq27541_get_psp voltage_now= 2945000 uV
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.509185] bq27541_get_capacity = 89% ret= 88
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.509735] bq27541_get_psp temperature= 215 (0.1¢XC)
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.510864] bq27541_get_psp current = -261 mA
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.512756] bq27541_get_psp status: Charging ret= 0x0101
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.513305] bq27541_get_psp voltage_now= 4099000 uV
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.514709] bq27541_get_capacity = 89% ret= 88
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.515411] bq27541_get_psp temperature= 215 (0.1¢XC)
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.516510] bq27541_get_psp current = -261 mA
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.519378] bq27541_get_psp voltage_now= 4099000 uV
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.520782] bq27541_get_psp status: Charging ret= 0x0101
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.522430] bq27541_get_psp current = -261 mA
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.523071] bq27541_get_psp voltage_now= 4099000 uV
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.523742] bq27541_get_capacity = 89% ret= 88
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.524383] bq27541_get_psp temperature= 215 (0.1¢XC)
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.606140] smb345_charger: [smb345_config_thermal_limit] Bypass set HRD SFT limit=73
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.606384] smb345_charger: [smb345_config_thermal_charging] temp=21, volt=4119000
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.606781] smb345_charger: [smb345_config_thermal_charging] Bypass set Float Volt=e8
Mar 18 12:03:39 ubuntu-phablet kernel: [  184.607025] smb345_charger: [smb345_config_thermal_charging] Bypass charger enable
}}}

Application Log: {{{
libust[2672/2674]: Error: Error opening shm /lttng-ust-wait-5 (in get_wait_shm() at lttng-ust-comm.c:881)
libust[2672/2674]: Error: Error opening shm /lttng-ust-wait-5 (in get_wait_shm() at lttng-ust-comm.c:881)
libust[2672/2675]: Error: Error opening shm /lttng-ust-wait-5-32011 (in get_wait_shm() at lttng-ust-comm.c:881)
libust[2672/2675]: Error: Error opening shm /lttng-ust-wait-5-32011 (in get_wait_shm() at lttng-ust-comm.c:881)
Testability driver loaded. Wire protocol version is "1.4".
virtual QString QOrganizerEDSFactory::managerName() const 
virtual QtOrganizer::QOrganizerManagerEngine* QOrganizerEDSFactory::engine(const QMap<QString, QString>&, QtOrganizer::QOrganizerManager::Error*) eds 

(process:2672): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.

(process:2672): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.

(process:2672): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.
creating surface at (0, 58) with size (1200, 1862) with title 'qmlscene: clock'libust[2836/2839]: Error: Error opening shm /lttng-ust-wait-5-32011 (in
get_wait_shm() at lttng-ust-comm.c:881)
libust[2836/2839]: Error: Error opening shm /lttng-ust-wait-5-32011 (in get_wait_shm() at lttng-ust-comm.c:881)
Testability driver loaded. Wire protocol version is "1.4".
virtual QString QOrganizerEDSFactory::managerName() const 
virtual QtOrganizer::QOrganizerManagerEngine* QOrganizerEDSFactory::engine(const QMap<QString, QString>&, QtOrganizer::QOrganizerManager::Error*) eds 

(process:2836): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.

(process:2836): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.

(process:2836): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.
creating surface at (0, 58) with size (1200, 1862) with title 'qmlscene: clock'libust[3252/3254]: Error: Error opening shm /lttng-ust-wait-5 (in
get_wait_shm() at lttng-ust-comm.c:881)
libust[3252/3254]: Error: Error opening shm /lttng-ust-wait-5 (in get_wait_shm() at lttng-ust-comm.c:881)
libust[3252/3255]: Error: Error opening shm /lttng-ust-wait-5-32011 (in get_wait_shm() at lttng-ust-comm.c:881)
libust[3252/3255]: Error: Error opening shm /lttng-ust-wait-5-32011 (in get_wait_shm() at lttng-ust-comm.c:881)
Testability driver loaded. Wire protocol version is "1.4".
virtual QString QOrganizerEDSFactory::managerName() const 
virtual QtOrganizer::QOrganizerManagerEngine* QOrganizerEDSFactory::engine(const QMap<QString, QString>&, QtOrganizer::QOrganizerManager::Error*) eds 

(process:3252): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.

(process:3252): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.

(process:3252): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.
creating surface at (0, 58) with size (1200, 1862) with title 'qmlscene: clock'libust[3351/3354]: Error: Error opening shm /lttng-ust-wait-5-32011 (in
get_wait_shm() at lttng-ust-comm.c:881)
libust[3351/3354]: Error: Error opening shm /lttng-ust-wait-5-32011 (in get_wait_shm() at lttng-ust-comm.c:881)
Testability driver loaded. Wire protocol version is "1.4".
virtual QString QOrganizerEDSFactory::managerName() const 
virtual QtOrganizer::QOrganizerManagerEngine* QOrganizerEDSFactory::engine(const QMap<QString, QString>&, QtOrganizer::QOrganizerManager::Error*) eds 

(process:3351): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.

(process:3351): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.

(process:3351): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.
creating surface at (0, 58) with size (1200, 1862) with title 'qmlscene: clock'libust[3505/3508]: Error: Error opening shm /lttng-ust-wait-5-32011 (in
get_wait_shm() at lttng-ust-comm.c:881)
libust[3505/3508]: Error: Error opening shm /lttng-ust-wait-5-32011 (in get_wait_shm() at lttng-ust-comm.c:881)
Testability driver loaded. Wire protocol version is "1.4".
virtual QString QOrganizerEDSFactory::managerName() const 
virtual QtOrganizer::QOrganizerManagerEngine* QOrganizerEDSFactory::engine(const QMap<QString, QString>&, QtOrganizer::QOrganizerManager::Error*) eds 

(process:3505): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.

(process:3505): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.

(process:3505): dconf-CRITICAL **: unable to create file '/run/user/32011/dconf/user': Permission denied.  dconf will not work properly.
creating surface at (0, 58) with size (1200, 1862) with title 'qmlscene: clock'
}}}

test-log: {{{
12:03:31.814 INFO globals:57 - ************************************************************
12:03:31.820 INFO globals:58 - Starting test ubuntu_clock_app.tests.test_timer.TestTimer.test_edit_preset_must_update_preset
12:03:31.822 WARNING testcase:115 - No tracing available - install the python-autopilot-trace package!
12:03:31.835 WARNING testcase:152 - Process manager backend unavailable, application snapshot support disabled.
12:03:31.838 DEBUG __init__:103 - Backed up database
12:03:34.828 INFO _launcher:83 - Click package com.ubuntu.clock_clock_1.0.373 has been launched with PID 3505
12:03:37.343 DEBUG dbus:432 - Selecting objects of type MainView with attributes: {}
12:03:37.529 DEBUG dbus:432 - Selecting objects of type MainView with attributes: {}
12:03:37.559 INFO logging:45 - MainView: Open the Timer tab. Arguments (). Keyword arguments: {}.
12:03:37.560 INFO logging:45 - MainView: Open a tab. Arguments ('TimerTab',). Keyword arguments: {}.
12:03:37.561 DEBUG dbus:432 - Selecting objects of type Tabs with attributes: {}
12:03:37.589 DEBUG dbus:432 - Selecting objects of type Tab with attributes: {}
12:03:37.823 INFO logging:45 - MainView: Open a tab. Arguments (2,). Keyword arguments: {}.
12:03:37.824 DEBUG emulators:141 - Switch to tab with index 2.
12:03:37.824 DEBUG dbus:432 - Selecting objects of type Tabs with attributes: {}
12:03:37.864 DEBUG dbus:432 - Selecting objects of type Tab with attributes: {}
12:03:37.989 DEBUG dbus:432 - Selecting objects of type Tab with attributes: {}
12:03:38.272 DEBUG emulators:150 - Current tab index: 0.
12:03:38.273 INFO logging:45 - MainView: Open the next tab. Arguments (). Keyword arguments: {}.
12:03:38.274 DEBUG emulators:126 - Switch to next tab.
12:03:38.274 DEBUG dbus:432 - Selecting objects of type Header with attributes: {'objectName': 'MainView_Header'}
12:03:38.505 INFO logging:45 - Header: Open the next tab. Arguments (). Keyword arguments: {}.
12:03:38.506 DEBUG dbus:432 - Selecting objects of type TabBar with attributes: {}
12:03:38.540 INFO logging:45 - TabBar: Open the next tab. Arguments (). Keyword arguments: {}.
12:03:38.574 DEBUG emulators:350 - Already in selection mode.
12:03:38.575 DEBUG emulators:345 - Click the next tab bar button.
12:03:38.576 DEBUG dbus:432 - Selecting objects of type QQuickPathView with attributes: {}
12:03:38.673 DEBUG dbus:432 - Selecting objects of type AbstractButton with attributes: {}
12:03:38.928 DEBUG dbus:432 - Selecting objects of type AbstractButton with attributes: {}
12:03:39.367 DEBUG _common:45 - Moving to object's globalRect coordinates.
12:03:39.368 DEBUG _uinput:475 - Tapping at: 334,125
12:03:39.470 DEBUG dbus:432 - Selecting objects of type TabBarStyle with attributes: {}
12:03:40.998 DEBUG dbus:432 - Selecting objects of type Tabs with attributes: {}
12:03:41.078 DEBUG dbus:432 - Selecting objects of type Tab with attributes: {}
12:03:41.343 DEBUG emulators:150 - Current tab index: 1.
12:03:41.344 INFO logging:45 - MainView: Open the next tab. Arguments (). Keyword arguments: {}.
12:03:41.345 DEBUG emulators:126 - Switch to next tab.
12:03:41.345 DEBUG dbus:432 - Selecting objects of type Header with attributes: {'objectName': 'MainView_Header'}
12:03:41.570 INFO logging:45 - Header: Open the next tab. Arguments (). Keyword arguments: {}.
12:03:41.571 DEBUG dbus:432 - Selecting objects of type TabBar with attributes: {}
12:03:41.608 INFO logging:45 - TabBar: Open the next tab. Arguments (). Keyword arguments: {}.
12:03:41.644 DEBUG emulators:353 - Click the tab bar to enable selection mode.
12:03:41.684 DEBUG _common:45 - Moving to object's globalRect coordinates.
12:03:41.685 DEBUG _uinput:475 - Tapping at: 600,125
12:03:41.787 DEBUG emulators:345 - Click the next tab bar button.
12:03:41.788 DEBUG dbus:432 - Selecting objects of type QQuickPathView with attributes: {}
12:03:41.907 DEBUG dbus:432 - Selecting objects of type AbstractButton with attributes: {}
12:03:42.183 DEBUG dbus:432 - Selecting objects of type AbstractButton with attributes: {}
12:03:42.760 DEBUG _common:45 - Moving to object's globalRect coordinates.
12:03:42.761 DEBUG _uinput:475 - Tapping at: 347,125
12:03:42.863 DEBUG dbus:432 - Selecting objects of type TabBarStyle with attributes: {}
12:03:44.895 DEBUG dbus:432 - Selecting objects of type Tabs with attributes: {}
12:03:44.992 DEBUG dbus:432 - Selecting objects of type Tab with attributes: {}
12:03:45.403 DEBUG dbus:432 - Selecting objects of type TimerPage with attributes: {}
12:03:45.493 DEBUG dbus:432 - Selecting objects of type MainView with attributes: {}
12:03:45.557 DEBUG dbus:432 - Selecting objects of type QQuickListView with attributes: {}
12:03:45.737 DEBUG dbus:432 - Selecting objects of type Label with attributes: {'objectName': 'presetTextLabel0'}
12:03:46.007 DEBUG dbus:432 - Selecting objects of type MainView with attributes: {}
12:03:46.139 DEBUG dbus:432 - Selecting objects of type Label with attributes: {'objectName': 'presetTimerLabel0'}
12:03:46.424 DEBUG dbus:432 - Selecting objects of type MainView with attributes: {}
12:03:46.559 DEBUG dbus:432 - Selecting objects of type Label with attributes: {'objectName': 'presetTextLabel1'}
12:03:46.831 DEBUG dbus:432 - Selecting objects of type MainView with attributes: {}
12:03:46.949 DEBUG dbus:432 - Selecting objects of type Label with attributes: {'objectName': 'presetTimerLabel1'}
12:03:47.162 DEBUG dbus:432 - Selecting objects of type MainView with attributes: {}
12:03:47.224 DEBUG dbus:432 - Selecting objects of type Label with attributes: {'objectName': 'presetTextLabel2'}
12:03:47.448 DEBUG dbus:432 - Selecting objects of type MainView with attributes: {}
12:03:47.526 DEBUG dbus:432 - Selecting objects of type Label with attributes: {'objectName': 'presetTimerLabel2'}
12:03:47.789 DEBUG dbus:432 - Selecting objects of type MainView with attributes: {}
12:03:47.915 INFO logging:45 - TimerPage: Edit timer preset. Arguments (u'Soft-boiled eggEdit', 0). Keyword arguments: {}.
12:03:47.968 DEBUG dbus:432 - Selecting objects of type QQuickFlickable with attributes: {'objectName': 'animationContainer'}
12:03:48.274 DEBUG dbus:432 - Selecting objects of type MainView with attributes: {}
12:03:48.480 DEBUG _uinput:546 - Dragging from 600,989 to 600,369
12:03:49.124 DEBUG dbus:432 - Selecting objects of type QQuickFlickable with attributes: {'objectName': 'animationContainer'}
12:03:49.458 DEBUG dbus:432 - Selecting objects of type MainView with attributes: {}
12:03:50.772 DEBUG dbus:432 - Selecting objects of type QQuickListView with attributes: {'objectName': 'listTimerPreset'}
12:03:51.032 INFO logging:45 - QQuickListView: Click an element from the list. Arguments ('preset0',). Keyword arguments: {}.
12:03:51.033 DEBUG dbus:432 - Selecting objects of any type with attributes: {'objectName': 'preset0'}
12:03:51.193 DEBUG dbus:432 - Selecting objects of any type with attributes: {'objectName': 'preset0'}
12:03:51.717 DEBUG dbus:432 - Selecting objects of any type with attributes: {'objectName': 'preset0'}
12:03:51.931 DEBUG _common:45 - Moving to object's globalRect coordinates.
12:03:51.932 DEBUG _uinput:475 - Tapping at: 600,1436
12:03:52.035 DEBUG dbus:432 - Selecting objects of type LabelDots with attributes: {'objectName': 'namePreset'}
12:03:52.318 DEBUG _common:45 - Moving to object's globalRect coordinates.
12:03:52.319 DEBUG _uinput:475 - Tapping at: 600,794
12:04:03.300 INFO _launcher:264 - waiting for process to exit.
12:04:03.302 INFO _launcher:279 - Killing process 3505
}}}

Traceback (most recent call last):
  File "/home/phablet/autopilot/ubuntu_clock_app/tests/test_timer.py", line 83, in test_edit_preset_must_update_preset
    self.page.edit_preset_timer(edited_name, timer_index)
  File "/usr/lib/python2.7/dist-packages/autopilot/logging.py", line 46, in inner
    return f(instance, *args, **kwargs)
  File "/home/phablet/autopilot/ubuntu_clock_app/emulators.py", line 837, in edit_preset_timer
    self._set_timer_name(name)
  File "/home/phablet/autopilot/ubuntu_clock_app/emulators.py", line 727, in _set_timer_name
    name_label.write(name)
  File "/home/phablet/autopilot/ubuntuuitoolkit/emulators.py", line 473, in write
    self.focus.wait_for(True)
  File "/usr/lib/python2.7/dist-packages/autopilot/introspection/types.py", line 181, in wait_for
    failure_msg))
AssertionError: After 10.0 seconds test on LabelDots.focus failed: True != dbus.Boolean(False, variant_level=1)

command_type
testcase_test