builder: fx-team_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0048 starttime: 1448036023.74 results: success (0) buildid: 20151120061737 builduid: 4c6d16abb3f54c3086197b408569d7a0 revision: 9d449237638a706f53fa985bc4e3be16e170f220 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-20 08:13:43.743040) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-20 08:13:43.743460) ========= ========= Started set props: basedir (results: 0, elapsed: 14 secs) (at 2015-11-20 08:13:43.743768) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.j5gZlaa0CW/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.poedk48og4/Listeners TMPDIR=/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.005532 basedir: '/builds/slave/test' ========= master_lag: 14.90 ========= ========= Finished set props: basedir (results: 0, elapsed: 14 secs) (at 2015-11-20 08:13:58.647885) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 10 secs) (at 2015-11-20 08:13:58.648323) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 10 secs) (at 2015-11-20 08:14:08.771924) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 6 secs) (at 2015-11-20 08:14:08.772231) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.j5gZlaa0CW/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.poedk48og4/Listeners TMPDIR=/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.005193 ========= master_lag: 6.82 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 6 secs) (at 2015-11-20 08:14:15.601522) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-20 08:14:15.601900) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-20 08:14:15.602316) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 08:14:15.602631) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.j5gZlaa0CW/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.poedk48og4/Listeners TMPDIR=/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2015-11-20 08:14:15-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 9.67M=0.001s 2015-11-20 08:14:15 (9.67 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.135572 ========= master_lag: 0.65 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 08:14:16.388375) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 08:14:16.388692) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.j5gZlaa0CW/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.poedk48og4/Listeners TMPDIR=/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.019546 ========= master_lag: 0.10 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 08:14:16.506013) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 08:14:16.506423) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 9d449237638a706f53fa985bc4e3be16e170f220 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 9d449237638a706f53fa985bc4e3be16e170f220 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.j5gZlaa0CW/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.poedk48og4/Listeners TMPDIR=/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2015-11-20 08:14:16,589 truncating revision to first 12 chars 2015-11-20 08:14:16,589 Setting DEBUG logging. 2015-11-20 08:14:16,589 attempt 1/10 2015-11-20 08:14:16,589 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/9d449237638a?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-20 08:14:17,072 unpacking tar archive at: fx-team-9d449237638a/testing/mozharness/ program finished with exit code 0 elapsedTime=0.721298 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 08:14:17.249603) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-20 08:14:17.249939) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-20 08:14:17.263235) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-20 08:14:17.263559) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-20 08:14:17.263994) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 18 secs) (at 2015-11-20 08:14:17.264359) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--system-bits', '64', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.j5gZlaa0CW/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.poedk48og4/Listeners TMPDIR=/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 08:14:17 INFO - MultiFileLogger online at 20151120 08:14:17 in /builds/slave/test 08:14:17 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 08:14:17 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:14:17 INFO - {'append_to_log': False, 08:14:17 INFO - 'base_work_dir': '/builds/slave/test', 08:14:17 INFO - 'blob_upload_branch': 'Fx-Team', 08:14:17 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:14:17 INFO - 'branch': 'Fx-Team', 08:14:17 INFO - 'buildbot_json_path': 'buildprops.json', 08:14:17 INFO - 'config_files': ('talos/mac_config.py',), 08:14:17 INFO - 'default_actions': ('clobber', 08:14:17 INFO - 'read-buildbot-config', 08:14:17 INFO - 'download-and-extract', 08:14:17 INFO - 'populate-webroot', 08:14:17 INFO - 'create-virtualenv', 08:14:17 INFO - 'install', 08:14:17 INFO - 'run-tests'), 08:14:17 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:14:17 INFO - 'download_minidump_stackwalk': True, 08:14:17 INFO - 'download_symbols': 'ondemand', 08:14:17 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:14:17 INFO - 'tooltool.py': '/tools/tooltool.py', 08:14:17 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:14:17 INFO - '/tools/misc-python/virtualenv.py')}, 08:14:17 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:14:17 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:14:17 INFO - 'installer_path': 'installer.exe', 08:14:17 INFO - 'log_level': 'info', 08:14:17 INFO - 'log_name': 'talos', 08:14:17 INFO - 'log_to_console': True, 08:14:17 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 08:14:17 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 08:14:17 INFO - 'opt_config_files': (), 08:14:17 INFO - 'pip_index': False, 08:14:17 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 08:14:17 INFO - 'cmd': ('bash', 08:14:17 INFO - '-c', 08:14:17 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 08:14:17 INFO - 'enabled': True, 08:14:17 INFO - 'halt_on_failure': False, 08:14:17 INFO - 'name': 'check_screen_resolution'},), 08:14:17 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 08:14:17 INFO - 'cmd': ('bash', 08:14:17 INFO - '-c', 08:14:17 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 08:14:17 INFO - 'enabled': True, 08:14:17 INFO - 'halt_on_failure': False, 08:14:17 INFO - 'name': 'check_screen_resolution'},), 08:14:17 INFO - 'run_cmd_checks_enabled': True, 08:14:17 INFO - 'sps_profile': False, 08:14:17 INFO - 'sps_profile_interval': 0, 08:14:17 INFO - 'suite': 'dromaeojs-e10s', 08:14:17 INFO - 'system_bits': '64', 08:14:17 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:14:17 INFO - 'title': 't-yosemite-r7-0048', 08:14:17 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:14:17 INFO - 'use_talos_json': True, 08:14:17 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:14:17 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:14:17 INFO - 'work_dir': 'build'} 08:14:17 INFO - ##### 08:14:17 INFO - ##### Running clobber step. 08:14:17 INFO - ##### 08:14:17 INFO - Running pre-action listener: _resource_record_pre_action 08:14:17 INFO - Running main action method: clobber 08:14:17 INFO - rmtree: /builds/slave/test/build 08:14:17 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:14:18 INFO - Running post-action listener: _resource_record_post_action 08:14:18 INFO - ##### 08:14:18 INFO - ##### Running read-buildbot-config step. 08:14:18 INFO - ##### 08:14:18 INFO - Running pre-action listener: _resource_record_pre_action 08:14:18 INFO - Running main action method: read_buildbot_config 08:14:18 INFO - Using buildbot properties: 08:14:18 INFO - { 08:14:18 INFO - "properties": { 08:14:18 INFO - "buildnumber": 15, 08:14:18 INFO - "product": "firefox", 08:14:18 INFO - "script_repo_revision": "production", 08:14:18 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs-e10s", 08:14:18 INFO - "repository": "", 08:14:18 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs-e10s", 08:14:18 INFO - "buildid": "20151120061737", 08:14:18 INFO - "slavename": "t-yosemite-r7-0048", 08:14:18 INFO - "pgo_build": "False", 08:14:18 INFO - "basedir": "/builds/slave/test", 08:14:18 INFO - "project": "", 08:14:18 INFO - "platform": "yosemite_r7", 08:14:18 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 08:14:18 INFO - "slavebuilddir": "test", 08:14:18 INFO - "scheduler": "tests-fx-team-macosx64-talos", 08:14:18 INFO - "branch": "fx-team", 08:14:18 INFO - "repo_path": "integration/fx-team", 08:14:18 INFO - "stage_platform": "macosx64", 08:14:18 INFO - "builduid": "4c6d16abb3f54c3086197b408569d7a0", 08:14:18 INFO - "revision": "9d449237638a706f53fa985bc4e3be16e170f220" 08:14:18 INFO - }, 08:14:18 INFO - "sourcestamp": { 08:14:18 INFO - "repository": "", 08:14:18 INFO - "hasPatch": false, 08:14:18 INFO - "project": "", 08:14:18 INFO - "branch": "fx-team-macosx64-talos", 08:14:18 INFO - "changes": [ 08:14:18 INFO - { 08:14:18 INFO - "category": null, 08:14:18 INFO - "files": [ 08:14:18 INFO - { 08:14:18 INFO - "url": null, 08:14:18 INFO - "name": "https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 08:14:18 INFO - } 08:14:18 INFO - ], 08:14:18 INFO - "repository": "", 08:14:18 INFO - "rev": "9d449237638a706f53fa985bc4e3be16e170f220", 08:14:18 INFO - "who": "gijskruitbosch@gmail.com", 08:14:18 INFO - "when": 1448034034, 08:14:18 INFO - "number": 6688960, 08:14:18 INFO - "comments": "Bug 1222971 - don't let mouseover/mouseout remove the selectedButton that was set, r=florian", 08:14:18 INFO - "project": "", 08:14:18 INFO - "at": "Fri 20 Nov 2015 07:40:34", 08:14:18 INFO - "branch": "fx-team-macosx64-talos", 08:14:18 INFO - "revlink": "", 08:14:18 INFO - "properties": [ 08:14:18 INFO - [ 08:14:18 INFO - "buildid", 08:14:18 INFO - "20151120061737", 08:14:18 INFO - "Change" 08:14:18 INFO - ], 08:14:18 INFO - [ 08:14:18 INFO - "builduid", 08:14:18 INFO - "4c6d16abb3f54c3086197b408569d7a0", 08:14:18 INFO - "Change" 08:14:18 INFO - ], 08:14:18 INFO - [ 08:14:18 INFO - "pgo_build", 08:14:18 INFO - "False", 08:14:18 INFO - "Change" 08:14:18 INFO - ] 08:14:18 INFO - ], 08:14:18 INFO - "revision": "9d449237638a706f53fa985bc4e3be16e170f220" 08:14:18 INFO - } 08:14:18 INFO - ], 08:14:18 INFO - "revision": "9d449237638a706f53fa985bc4e3be16e170f220" 08:14:18 INFO - } 08:14:18 INFO - } 08:14:18 INFO - Found installer url https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 08:14:18 INFO - Running post-action listener: _resource_record_post_action 08:14:18 INFO - ##### 08:14:18 INFO - ##### Running download-and-extract step. 08:14:18 INFO - ##### 08:14:18 INFO - Running pre-action listener: _resource_record_pre_action 08:14:18 INFO - Running main action method: download_and_extract 08:14:18 INFO - mkdir: /builds/slave/test/build/tests 08:14:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:18 INFO - https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 08:14:18 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/test_packages.json 08:14:18 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/test_packages.json 08:14:18 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 08:14:18 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 08:14:19 INFO - Downloaded 1149 bytes. 08:14:19 INFO - Reading from file /builds/slave/test/build/test_packages.json 08:14:19 INFO - Using the following test package requirements: 08:14:19 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 08:14:19 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 08:14:19 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 08:14:19 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 08:14:19 INFO - u'jsshell-mac.zip'], 08:14:19 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 08:14:19 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 08:14:19 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 08:14:19 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 08:14:19 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 08:14:19 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 08:14:19 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 08:14:19 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 08:14:19 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 08:14:19 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 08:14:19 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 08:14:19 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 08:14:19 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 08:14:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:19 INFO - https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 08:14:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 08:14:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 08:14:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 08:14:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 08:14:20 INFO - Downloaded 17526047 bytes. 08:14:20 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 08:14:20 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 08:14:20 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 08:14:23 INFO - Return code: 0 08:14:23 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip', u'firefox-45.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 08:14:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:23 INFO - https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 08:14:23 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 08:14:23 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 08:14:23 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 08:14:23 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 08:14:24 INFO - Downloaded 17526047 bytes. 08:14:24 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 08:14:24 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 08:14:24 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 08:14:28 INFO - Return code: 0 08:14:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:28 INFO - https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 08:14:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 08:14:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 08:14:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 08:14:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'}, attempt #1 08:14:29 INFO - Downloaded 11130997 bytes. 08:14:29 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] in /builds/slave/test/build/tests 08:14:29 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 08:14:29 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 08:14:29 INFO - Return code: 0 08:14:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:29 INFO - https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 08:14:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 08:14:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 08:14:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 08:14:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg'}, attempt #1 08:14:32 INFO - Downloaded 109411996 bytes. 08:14:32 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 08:14:32 INFO - mkdir: /builds/slave/test/properties 08:14:32 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:14:32 INFO - Writing to file /builds/slave/test/properties/build_url 08:14:32 INFO - Contents: 08:14:32 INFO - build_url:https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 08:14:32 INFO - Running post-action listener: _resource_record_post_action 08:14:32 INFO - Running post-action listener: set_extra_try_arguments 08:14:32 INFO - ##### 08:14:32 INFO - ##### Running populate-webroot step. 08:14:32 INFO - ##### 08:14:32 INFO - Running pre-action listener: _resource_record_pre_action 08:14:32 INFO - Running main action method: populate_webroot 08:14:32 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:14:32 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:14:32 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 08:14:32 INFO - '../fennec_ids.txt'], 08:14:32 INFO - 'tests': ['tcheck2']}, 08:14:32 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:14:32 INFO - '--tppagecycles', 08:14:32 INFO - '7'], 08:14:32 INFO - 'tests': ['tsvgm']}}, 08:14:32 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 08:14:32 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 08:14:32 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:14:32 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 08:14:32 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 08:14:32 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 08:14:32 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:14:32 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:14:32 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:14:32 INFO - 'talos_options': ['--e10s'], 08:14:32 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:14:32 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:14:32 INFO - 'tests': ['damp', 'tps']}, 08:14:32 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:14:32 INFO - 'talos_options': ['--e10s'], 08:14:32 INFO - 'tests': ['damp', 'tps']}, 08:14:32 INFO - 'g3': {'tests': ['dromaeo_dom']}, 08:14:32 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:14:32 INFO - 'other': {'tests': ['a11yr', 08:14:32 INFO - 'ts_paint', 08:14:32 INFO - 'tpaint', 08:14:32 INFO - 'sessionrestore', 08:14:32 INFO - 'sessionrestore_no_auto_restore']}, 08:14:32 INFO - 'other-e10s': {'talos_options': ['--e10s'], 08:14:32 INFO - 'tests': ['a11yr', 08:14:32 INFO - 'ts_paint', 08:14:32 INFO - 'tpaint', 08:14:32 INFO - 'sessionrestore', 08:14:32 INFO - 'sessionrestore_no_auto_restore']}, 08:14:32 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 08:14:32 INFO - 'tests': ['a11yr', 08:14:32 INFO - 'ts_paint', 08:14:32 INFO - 'tpaint', 08:14:32 INFO - 'sessionrestore', 08:14:32 INFO - 'sessionrestore_no_auto_restore']}, 08:14:32 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 08:14:32 INFO - 'tests': ['a11yr', 08:14:32 INFO - 'ts_paint', 08:14:32 INFO - 'tpaint', 08:14:32 INFO - 'sessionrestore', 08:14:32 INFO - 'sessionrestore_no_auto_restore']}, 08:14:32 INFO - 'other_l64': {'tests': ['a11yr', 08:14:32 INFO - 'ts_paint', 08:14:32 INFO - 'tpaint', 08:14:32 INFO - 'sessionrestore', 08:14:32 INFO - 'sessionrestore_no_auto_restore']}, 08:14:32 INFO - 'other_nol64': {'tests': ['a11yr', 08:14:32 INFO - 'ts_paint', 08:14:32 INFO - 'tpaint', 08:14:32 INFO - 'sessionrestore', 08:14:32 INFO - 'sessionrestore_no_auto_restore']}, 08:14:32 INFO - 'svgr': {'tests': ['tsvgx', 08:14:32 INFO - 'tsvgr_opacity', 08:14:32 INFO - 'tart', 08:14:32 INFO - 'tscrollx', 08:14:32 INFO - 'cart']}, 08:14:32 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 08:14:32 INFO - 'tests': ['tsvgx', 08:14:32 INFO - 'tsvgr_opacity', 08:14:32 INFO - 'tart', 08:14:32 INFO - 'tscrollx', 08:14:32 INFO - 'cart']}, 08:14:32 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:14:32 INFO - 'tests': ['tp5o']}, 08:14:32 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:14:32 INFO - 'talos_options': ['--e10s'], 08:14:32 INFO - 'tests': ['tp5o']}, 08:14:32 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:14:32 INFO - 'talos_options': ['--xperf_path', 08:14:32 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:14:32 INFO - 'tests': ['tp5n']}, 08:14:32 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:14:32 INFO - 'talos_options': ['--e10s', 08:14:32 INFO - '--xperf_path', 08:14:32 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:14:32 INFO - 'tests': ['tp5n']}}, 08:14:32 INFO - 'talos.zip': {'path': '', 08:14:32 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:14:32 INFO - Running post-action listener: _resource_record_post_action 08:14:32 INFO - ##### 08:14:32 INFO - ##### Running create-virtualenv step. 08:14:32 INFO - ##### 08:14:32 INFO - Running pre-action listener: _resource_record_pre_action 08:14:32 INFO - Running main action method: create_virtualenv 08:14:32 INFO - Creating virtualenv /builds/slave/test/build/venv 08:14:32 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 08:14:32 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:14:33 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:14:33 INFO - Using real prefix '/tools/python27' 08:14:33 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:14:33 INFO - Installing distribute.............................................................................................................................................................................................done. 08:14:36 INFO - Installing pip.................done. 08:14:36 INFO - Return code: 0 08:14:36 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:14:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:14:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:14:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x103636490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103613228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1135b2570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10355a9f0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1032b9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10354d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 08:14:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 08:14:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 08:14:36 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 08:14:36 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:14:36 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:14:36 INFO - 'HOME': '/Users/cltbld', 08:14:36 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:14:36 INFO - 'LOGNAME': 'cltbld', 08:14:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:14:36 INFO - 'MOZ_NO_REMOTE': '1', 08:14:36 INFO - 'NO_EM_RESTART': '1', 08:14:36 INFO - 'PAGER': '/bin/cat', 08:14:36 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:14:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:14:36 INFO - 'PWD': '/builds/slave/test', 08:14:36 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:14:36 INFO - 'SHELL': '/bin/bash', 08:14:36 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 08:14:36 INFO - 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', 08:14:36 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:14:36 INFO - 'USER': 'cltbld', 08:14:36 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:14:36 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:14:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:14:36 INFO - 'XPC_FLAGS': '0x0', 08:14:36 INFO - 'XPC_SERVICE_NAME': '0', 08:14:36 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:14:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:14:36 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 08:14:36 INFO - Cleaning up... 08:14:36 INFO - Return code: 0 08:14:36 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 08:14:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:14:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:14:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x103636490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103613228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1135b2570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10355a9f0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1032b9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10354d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 08:14:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 08:14:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 08:14:36 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 08:14:36 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:14:36 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:14:36 INFO - 'HOME': '/Users/cltbld', 08:14:36 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:14:36 INFO - 'LOGNAME': 'cltbld', 08:14:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:14:36 INFO - 'MOZ_NO_REMOTE': '1', 08:14:36 INFO - 'NO_EM_RESTART': '1', 08:14:36 INFO - 'PAGER': '/bin/cat', 08:14:36 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:14:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:14:36 INFO - 'PWD': '/builds/slave/test', 08:14:36 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:14:36 INFO - 'SHELL': '/bin/bash', 08:14:36 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 08:14:36 INFO - 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', 08:14:36 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:14:36 INFO - 'USER': 'cltbld', 08:14:36 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:14:36 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:14:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:14:36 INFO - 'XPC_FLAGS': '0x0', 08:14:36 INFO - 'XPC_SERVICE_NAME': '0', 08:14:36 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:14:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:14:37 INFO - Downloading/unpacking psutil>=0.7.1 08:14:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:14:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:14:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:14:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:14:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:14:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:14:39 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 08:14:39 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 08:14:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:14:39 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:14:39 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:14:39 INFO - Installing collected packages: psutil 08:14:39 INFO - Running setup.py install for psutil 08:14:39 INFO - building 'psutil._psutil_osx' extension 08:14:39 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 08:14:40 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 08:14:40 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 08:14:40 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 08:14:40 INFO - building 'psutil._psutil_posix' extension 08:14:40 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 08:14:40 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 08:14:40 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 08:14:40 INFO - ^ 08:14:40 INFO - 1 warning generated. 08:14:40 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 08:14:40 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:14:40 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:14:40 INFO - Successfully installed psutil 08:14:40 INFO - Cleaning up... 08:14:40 INFO - Return code: 0 08:14:40 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 08:14:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:14:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:14:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x103636490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103613228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1135b2570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10355a9f0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1032b9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10354d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 08:14:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 08:14:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 08:14:40 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 08:14:40 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:14:40 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:14:40 INFO - 'HOME': '/Users/cltbld', 08:14:40 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:14:40 INFO - 'LOGNAME': 'cltbld', 08:14:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:14:40 INFO - 'MOZ_NO_REMOTE': '1', 08:14:40 INFO - 'NO_EM_RESTART': '1', 08:14:40 INFO - 'PAGER': '/bin/cat', 08:14:40 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:14:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:14:40 INFO - 'PWD': '/builds/slave/test', 08:14:40 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:14:40 INFO - 'SHELL': '/bin/bash', 08:14:40 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 08:14:40 INFO - 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', 08:14:40 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:14:40 INFO - 'USER': 'cltbld', 08:14:40 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:14:40 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:14:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:14:40 INFO - 'XPC_FLAGS': '0x0', 08:14:40 INFO - 'XPC_SERVICE_NAME': '0', 08:14:40 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:14:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:14:40 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 08:14:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:14:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:14:40 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:14:40 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:14:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:14:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:14:42 INFO - Downloading mozsystemmonitor-0.0.tar.gz 08:14:42 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 08:14:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:14:43 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 08:14:43 INFO - Installing collected packages: mozsystemmonitor 08:14:43 INFO - Running setup.py install for mozsystemmonitor 08:14:43 INFO - Successfully installed mozsystemmonitor 08:14:43 INFO - Cleaning up... 08:14:43 INFO - Return code: 0 08:14:43 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:14:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:14:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:14:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x103636490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103613228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1135b2570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10355a9f0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1032b9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10354d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 08:14:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 08:14:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 08:14:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 08:14:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:14:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:14:43 INFO - 'HOME': '/Users/cltbld', 08:14:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:14:43 INFO - 'LOGNAME': 'cltbld', 08:14:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:14:43 INFO - 'MOZ_NO_REMOTE': '1', 08:14:43 INFO - 'NO_EM_RESTART': '1', 08:14:43 INFO - 'PAGER': '/bin/cat', 08:14:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:14:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:14:43 INFO - 'PWD': '/builds/slave/test', 08:14:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:14:43 INFO - 'SHELL': '/bin/bash', 08:14:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 08:14:43 INFO - 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', 08:14:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:14:43 INFO - 'USER': 'cltbld', 08:14:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:14:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:14:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:14:43 INFO - 'XPC_FLAGS': '0x0', 08:14:43 INFO - 'XPC_SERVICE_NAME': '0', 08:14:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:14:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:14:43 INFO - Downloading/unpacking blobuploader==1.2.4 08:14:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:14:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:14:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:14:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:14:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:14:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:14:45 INFO - Downloading blobuploader-1.2.4.tar.gz 08:14:45 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 08:14:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:14:45 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:14:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:14:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:14:45 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:14:45 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:14:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:14:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:14:46 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 08:14:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:14:46 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:14:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:14:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:14:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:14:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:14:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:14:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:14:46 INFO - Downloading docopt-0.6.1.tar.gz 08:14:46 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 08:14:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:14:46 INFO - Installing collected packages: blobuploader, requests, docopt 08:14:46 INFO - Running setup.py install for blobuploader 08:14:46 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:14:46 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:14:46 INFO - Running setup.py install for requests 08:14:47 INFO - Running setup.py install for docopt 08:14:47 INFO - Successfully installed blobuploader requests docopt 08:14:47 INFO - Cleaning up... 08:14:47 INFO - Return code: 0 08:14:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:14:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:14:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:14:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:47 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x103636490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103613228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1135b2570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10355a9f0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1032b9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10354d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 08:14:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 08:14:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:14:47 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 08:14:47 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:14:47 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:14:47 INFO - 'HOME': '/Users/cltbld', 08:14:47 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:14:47 INFO - 'LOGNAME': 'cltbld', 08:14:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:14:47 INFO - 'MOZ_NO_REMOTE': '1', 08:14:47 INFO - 'NO_EM_RESTART': '1', 08:14:47 INFO - 'PAGER': '/bin/cat', 08:14:47 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:14:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:14:47 INFO - 'PWD': '/builds/slave/test', 08:14:47 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:14:47 INFO - 'SHELL': '/bin/bash', 08:14:47 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 08:14:47 INFO - 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', 08:14:47 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:14:47 INFO - 'USER': 'cltbld', 08:14:47 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:14:47 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:14:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:14:47 INFO - 'XPC_FLAGS': '0x0', 08:14:47 INFO - 'XPC_SERVICE_NAME': '0', 08:14:47 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:14:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:14:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:14:47 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-RwQZis-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:14:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:14:48 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-AnCy9w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:14:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:14:48 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-_iLTyX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:14:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:14:48 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-jeW_OT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:14:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:14:48 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-K7wapT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:14:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:14:48 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-Qtecjj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:14:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:14:48 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-Gt368m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:14:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:14:48 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-3M2B5v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:14:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:14:48 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-TJ4LL7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:14:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:14:48 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-ZYbksF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:14:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:14:49 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-4nCwnQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:14:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:14:49 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-TK_673-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:14:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:14:49 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-qSslAh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:14:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:14:49 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-FQQowm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:14:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:14:49 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-tHEZCs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:14:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:14:49 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-jpFxmy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:14:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:14:49 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-u1Ml0e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:14:49 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:14:49 INFO - Running setup.py install for manifestparser 08:14:49 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:14:49 INFO - Running setup.py install for mozcrash 08:14:50 INFO - Running setup.py install for mozdebug 08:14:50 INFO - Running setup.py install for mozdevice 08:14:50 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:14:50 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:14:50 INFO - Running setup.py install for mozfile 08:14:50 INFO - Running setup.py install for mozhttpd 08:14:50 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:14:50 INFO - Running setup.py install for mozinfo 08:14:50 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:14:50 INFO - Running setup.py install for mozInstall 08:14:50 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:14:50 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:14:50 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:14:50 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:14:50 INFO - Running setup.py install for mozleak 08:14:51 INFO - Running setup.py install for mozlog 08:14:51 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:14:51 INFO - Running setup.py install for moznetwork 08:14:51 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:14:51 INFO - Running setup.py install for mozprocess 08:14:51 INFO - Running setup.py install for mozprofile 08:14:51 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:14:51 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:14:51 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:14:51 INFO - Running setup.py install for mozrunner 08:14:51 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:14:51 INFO - Running setup.py install for mozscreenshot 08:14:51 INFO - Running setup.py install for moztest 08:14:52 INFO - Running setup.py install for mozversion 08:14:52 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:14:52 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:14:52 INFO - Cleaning up... 08:14:52 INFO - Return code: 0 08:14:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:14:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:14:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:14:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x103636490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103613228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1135b2570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10355a9f0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1032b9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10354d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 08:14:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 08:14:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:14:52 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 08:14:52 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:14:52 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:14:52 INFO - 'HOME': '/Users/cltbld', 08:14:52 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:14:52 INFO - 'LOGNAME': 'cltbld', 08:14:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:14:52 INFO - 'MOZ_NO_REMOTE': '1', 08:14:52 INFO - 'NO_EM_RESTART': '1', 08:14:52 INFO - 'PAGER': '/bin/cat', 08:14:52 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:14:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:14:52 INFO - 'PWD': '/builds/slave/test', 08:14:52 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:14:52 INFO - 'SHELL': '/bin/bash', 08:14:52 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 08:14:52 INFO - 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', 08:14:52 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:14:52 INFO - 'USER': 'cltbld', 08:14:52 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:14:52 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:14:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:14:52 INFO - 'XPC_FLAGS': '0x0', 08:14:52 INFO - 'XPC_SERVICE_NAME': '0', 08:14:52 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:14:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:14:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:14:52 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-FOJywk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:14:52 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 08:14:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:14:52 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-wgYwXA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:14:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:14:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:14:52 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-Y3oYcw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:14:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:14:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:14:52 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-mmd2JL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:14:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:14:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:14:53 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-r1whkX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:14:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 08:14:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:14:53 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-gBBErw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:14:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 08:14:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:14:53 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-Neb3_b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:14:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 08:14:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:14:53 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-JtoPOg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:14:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 08:14:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:14:53 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-bpmAOW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:14:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 08:14:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:14:53 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-ki4W9u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:14:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:14:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:14:53 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-CpfEiW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:14:53 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 08:14:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:14:53 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-BeyuRe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:14:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 08:14:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:14:53 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-wEjJ81-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:14:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 08:14:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:14:53 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-TrEo4E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:14:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 08:14:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:14:54 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-ntwxTT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:14:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 08:14:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:14:54 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-nEFIbp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:14:54 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 08:14:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:14:54 INFO - Running setup.py (path:/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/pip-wS1d5L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:14:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 08:14:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:14:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:14:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:14:54 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:14:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:14:54 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:14:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:14:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:14:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:14:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:14:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:14:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:14:56 INFO - Downloading blessings-1.5.1.tar.gz 08:14:56 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 08:14:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:14:56 INFO - Installing collected packages: blessings 08:14:56 INFO - Running setup.py install for blessings 08:14:56 INFO - Successfully installed blessings 08:14:56 INFO - Cleaning up... 08:14:56 INFO - Return code: 0 08:14:56 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:14:56 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:14:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:14:57 INFO - Reading from file tmpfile_stdout 08:14:57 INFO - Current package versions: 08:14:57 INFO - blessings == 1.5.1 08:14:57 INFO - blobuploader == 1.2.4 08:14:57 INFO - docopt == 0.6.1 08:14:57 INFO - manifestparser == 1.1 08:14:57 INFO - mozInstall == 1.12 08:14:57 INFO - mozcrash == 0.16 08:14:57 INFO - mozdebug == 0.1 08:14:57 INFO - mozdevice == 0.47 08:14:57 INFO - mozfile == 1.2 08:14:57 INFO - mozhttpd == 0.7 08:14:57 INFO - mozinfo == 0.9 08:14:57 INFO - mozleak == 0.1 08:14:57 INFO - mozlog == 3.0 08:14:57 INFO - moznetwork == 0.27 08:14:57 INFO - mozprocess == 0.22 08:14:57 INFO - mozprofile == 0.27 08:14:57 INFO - mozrunner == 6.11 08:14:57 INFO - mozscreenshot == 0.1 08:14:57 INFO - mozsystemmonitor == 0.0 08:14:57 INFO - moztest == 0.7 08:14:57 INFO - mozversion == 1.4 08:14:57 INFO - psutil == 3.1.1 08:14:57 INFO - requests == 1.2.3 08:14:57 INFO - wsgiref == 0.1.2 08:14:57 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:14:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:14:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:14:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:14:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:14:57 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x103636490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x103613228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff1135b2570>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10355a9f0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1032b9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10354d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 08:14:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 08:14:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:14:57 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 08:14:57 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:14:57 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:14:57 INFO - 'HOME': '/Users/cltbld', 08:14:57 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:14:57 INFO - 'LOGNAME': 'cltbld', 08:14:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:14:57 INFO - 'MOZ_NO_REMOTE': '1', 08:14:57 INFO - 'NO_EM_RESTART': '1', 08:14:57 INFO - 'PAGER': '/bin/cat', 08:14:57 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:14:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:14:57 INFO - 'PWD': '/builds/slave/test', 08:14:57 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:14:57 INFO - 'SHELL': '/bin/bash', 08:14:57 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 08:14:57 INFO - 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', 08:14:57 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:14:57 INFO - 'USER': 'cltbld', 08:14:57 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:14:57 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:14:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:14:57 INFO - 'XPC_FLAGS': '0x0', 08:14:57 INFO - 'XPC_SERVICE_NAME': '0', 08:14:57 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:14:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:14:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:14:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 08:14:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 08:14:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:14:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 08:14:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 08:14:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 08:14:57 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 08:14:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:14:57 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 08:14:57 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:14:57 INFO - Cleaning up... 08:14:57 INFO - Return code: 0 08:14:57 INFO - Running post-action listener: _resource_record_post_action 08:14:57 INFO - Running post-action listener: _start_resource_monitoring 08:14:57 INFO - Starting resource monitoring. 08:14:57 INFO - ##### 08:14:57 INFO - ##### Running install step. 08:14:57 INFO - ##### 08:14:57 INFO - Running pre-action listener: _resource_record_pre_action 08:14:57 INFO - Running main action method: install 08:14:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:14:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:14:57 INFO - Reading from file tmpfile_stdout 08:14:57 INFO - Detecting whether we're running mozinstall >=1.0... 08:14:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:14:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:14:57 INFO - Reading from file tmpfile_stdout 08:14:57 INFO - Output received: 08:14:57 INFO - Usage: mozinstall [options] installer 08:14:57 INFO - Options: 08:14:57 INFO - -h, --help show this help message and exit 08:14:57 INFO - -d DEST, --destination=DEST 08:14:57 INFO - Directory to install application into. [default: 08:14:57 INFO - "/builds/slave/test"] 08:14:57 INFO - --app=APP Application being installed. [default: firefox] 08:14:57 INFO - mkdir: /builds/slave/test/build/application 08:14:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 08:14:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 08:15:28 INFO - Reading from file tmpfile_stdout 08:15:28 INFO - Output received: 08:15:28 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 08:15:28 INFO - Running post-action listener: _resource_record_post_action 08:15:28 INFO - ##### 08:15:28 INFO - ##### Running run-tests step. 08:15:28 INFO - ##### 08:15:28 INFO - Running pre-action listener: _resource_record_pre_action 08:15:28 INFO - Running main action method: run_tests 08:15:28 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 08:15:28 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 08:15:28 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 08:15:28 INFO - 2015-11-20 08:15:28.211 screenresolution[1964:14438] starting screenresolution argv=screenresolution get 08:15:28 INFO - 2015-11-20 08:15:28.214 screenresolution[1964:14438] Display 0: 1600x1200x32@60 08:15:28 INFO - 2015-11-20 08:15:28.220 screenresolution[1965:14440] starting screenresolution argv=screenresolution list 08:15:28 INFO - Available Modes on Display 0 08:15:28 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 08:15:28 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 08:15:28 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 08:15:28 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 08:15:28 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 08:15:28 INFO - Intel Iris: 08:15:28 INFO - Chipset Model: Intel Iris 08:15:28 INFO - Type: GPU 08:15:28 INFO - Bus: Built-In 08:15:28 INFO - VRAM (Dynamic, Max): 1536 MB 08:15:28 INFO - Vendor: Intel (0x8086) 08:15:28 INFO - Device ID: 0x0a2e 08:15:28 INFO - Revision ID: 0x0009 08:15:28 INFO - Displays: 08:15:28 INFO - Display: 08:15:28 INFO - Resolution: 1600 x 1200 @ 60 Hz 08:15:28 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 08:15:28 INFO - Display Serial Number: 1600x1200 60 08:15:28 INFO - Main Display: Yes 08:15:28 INFO - Mirror: Off 08:15:28 INFO - Online: Yes 08:15:28 INFO - Rotation: Supported 08:15:28 INFO - Return code: 0 08:15:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:15:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:15:28 INFO - Python 2.7.3 08:15:28 INFO - Return code: 0 08:15:28 INFO - grabbing minidump binary from tooltool 08:15:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:15:28 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10355a9f0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1032b9db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10354d8c8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:15:28 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 08:15:28 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 08:15:28 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:15:28 INFO - Return code: 0 08:15:28 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 08:15:28 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:15:28 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:15:28 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 08:15:28 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:15:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0048', '--webServer', 'localhost'] in /builds/slave/test/build 08:15:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0048 --webServer localhost 08:15:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.j5gZlaa0CW/Render', 08:15:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 08:15:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 08:15:28 INFO - 'HOME': '/Users/cltbld', 08:15:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 08:15:28 INFO - 'LOGNAME': 'cltbld', 08:15:28 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:15:28 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 08:15:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:15:28 INFO - 'MOZ_NO_REMOTE': '1', 08:15:28 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:15:28 INFO - 'NO_EM_RESTART': '1', 08:15:28 INFO - 'PAGER': '/bin/cat', 08:15:28 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 08:15:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:15:28 INFO - 'PWD': '/builds/slave/test', 08:15:28 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:15:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 08:15:28 INFO - 'SHELL': '/bin/bash', 08:15:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.poedk48og4/Listeners', 08:15:28 INFO - 'TMPDIR': '/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/', 08:15:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 08:15:28 INFO - 'USER': 'cltbld', 08:15:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 08:15:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 08:15:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:15:28 INFO - 'XPC_FLAGS': '0x0', 08:15:28 INFO - 'XPC_SERVICE_NAME': '0', 08:15:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 08:15:28 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0048', '--webServer', 'localhost'] with output_timeout 3600 08:15:28 INFO - mozversion INFO | application_buildid: 20151120061737 08:15:28 INFO - mozversion INFO | application_changeset: 9d449237638a706f53fa985bc4e3be16e170f220 08:15:28 INFO - mozversion INFO | application_display_name: Nightly 08:15:28 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:15:28 INFO - mozversion INFO | application_name: Firefox 08:15:28 INFO - mozversion INFO | application_remotingname: firefox 08:15:28 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 08:15:28 INFO - mozversion INFO | application_vendor: Mozilla 08:15:28 INFO - mozversion INFO | application_version: 45.0a1 08:15:28 INFO - mozversion INFO | platform_buildid: 20151120061737 08:15:28 INFO - mozversion INFO | platform_changeset: 9d449237638a706f53fa985bc4e3be16e170f220 08:15:28 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 08:15:28 INFO - mozversion INFO | platform_version: 45.0a1 08:15:28 INFO - 2015-11-20 08:15:28,757 DEBUG : using testdate: 1448036128 08:15:28 INFO - 2015-11-20 08:15:28,757 DEBUG : actual date: 1448036128 08:15:28 INFO - 2015-11-20 08:15:28,771 INFO : starting webserver on 'localhost:49536' 08:15:28 INFO - 2015-11-20 08:15:28,772 INFO : Starting test suite t-yosemite-r7-0048.e 08:15:28 INFO - 2015-11-20 08:15:28,772 INFO : Starting test dromaeo_css 08:15:28 INFO - 2015-11-20 08:15:28,772 DEBUG : operating with platform_type : mac_ 08:15:28 INFO - 2015-11-20 08:15:28,773 INFO : Initialising browser for dromaeo_css test... 08:15:28 INFO - 2015-11-20 08:15:28,784 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/tmprGFv1O/profile http://localhost:49536/getInfo.html 08:15:31 INFO - 2015-11-20 08:15:31,549 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 08:15:31 INFO - 2015-11-20 08:15:31,549 DEBUG : BROWSER_OUTPUT: colorDepth:24 08:15:31 INFO - 2015-11-20 08:15:31,549 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 08:15:31 INFO - 2015-11-20 08:15:31,549 DEBUG : BROWSER_OUTPUT: __metrics 08:15:32 INFO - 2015-11-20 08:15:32,142 INFO : Browser initialized. 08:15:32 INFO - 2015-11-20 08:15:32,143 INFO : Running cycle 1/1 for dromaeo_css test... 08:15:32 INFO - 2015-11-20 08:15:32,143 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/tmprGFv1O/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 08:15:44 INFO - 2015-11-20 08:15:44,101 DEBUG : BROWSER_OUTPUT: RSS: Main: 235929600 08:15:44 INFO - 2015-11-20 08:15:44,101 DEBUG : BROWSER_OUTPUT: 08:16:33 INFO - 2015-11-20 08:16:33,791 DEBUG : BROWSER_OUTPUT: 1448036193787 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 08:18:43 INFO - 2015-11-20 08:18:43,790 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49536/tests/dromaeo/cssquery-ext.html) 08:18:44 INFO - 2015-11-20 08:18:44,963 DEBUG : BROWSER_OUTPUT: RSS: Main: 252690432 08:18:44 INFO - 2015-11-20 08:18:44,963 DEBUG : BROWSER_OUTPUT: 08:21:46 INFO - 2015-11-20 08:21:46,980 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/dromaeo/cssquery-ext.html (next: http://localhost:49536/tests/dromaeo/cssquery-jquery.html) 08:21:47 INFO - 2015-11-20 08:21:47,574 DEBUG : BROWSER_OUTPUT: RSS: Main: 262721536 08:21:47 INFO - 2015-11-20 08:21:47,574 DEBUG : BROWSER_OUTPUT: 08:24:49 INFO - 2015-11-20 08:24:49,173 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49536/tests/dromaeo/cssquery-mootools.html) 08:24:49 INFO - 2015-11-20 08:24:49,783 DEBUG : BROWSER_OUTPUT: RSS: Main: 264716288 08:24:49 INFO - 2015-11-20 08:24:49,783 DEBUG : BROWSER_OUTPUT: 08:27:51 INFO - 2015-11-20 08:27:51,388 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49536/tests/dromaeo/cssquery-prototype.html) 08:27:51 INFO - 2015-11-20 08:27:51,988 DEBUG : BROWSER_OUTPUT: RSS: Main: 266424320 08:27:51 INFO - 2015-11-20 08:27:51,988 DEBUG : BROWSER_OUTPUT: 08:30:54 INFO - 2015-11-20 08:30:54,458 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49536/tests/dromaeo/cssquery-yui.html) 08:30:55 INFO - 2015-11-20 08:30:55,078 DEBUG : BROWSER_OUTPUT: RSS: Main: 268947456 08:30:55 INFO - 2015-11-20 08:30:55,078 DEBUG : BROWSER_OUTPUT: 08:33:57 INFO - 2015-11-20 08:33:57,492 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/dromaeo/cssquery-yui.html (next: http://localhost:49536/tests/dromaeo/cssquery-dojo.html) 08:33:57 INFO - 2015-11-20 08:33:57,749 DEBUG : BROWSER_OUTPUT: RSS: Main: 270823424 08:33:57 INFO - 2015-11-20 08:33:57,750 DEBUG : BROWSER_OUTPUT: 08:33:57 INFO - 2015-11-20 08:33:57,750 DEBUG : BROWSER_OUTPUT: __start_tp_report 08:33:57 INFO - 2015-11-20 08:33:57,750 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 08:33:57 INFO - 2015-11-20 08:33:57,750 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 08:33:57 INFO - 2015-11-20 08:33:57,750 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 08:33:57 INFO - 2015-11-20 08:33:57,750 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3093.814371137732;3215.4694475411557;3499.42259527178;3586.982065089674;3595.406757884949;6046.606970546912;6047.455728984396;6069.089636554519;6098.664573448458;6134.2332208473945;4681.4616319123315;5805.738741756621;5969.253843269591;6027.367126451714;6122.877542449149;4704.576588107069;5351.518363347308;5410.864728381783;5456.508914197721;5475.5072043516075;199.42563559666345;4767.547083027124;5209.166533354664;5521.917171242414;5598.944010559883;5014.899702005958;5399.946000539983;5415.296011518517;5429.647072940246;5488.17677348399;5444.6188766786345;5448.155535891943;5460.453954604547;5469.945300546983;5503.6147469677135;4452.443444569429;5208.244804503363;5217.087009773312;5350.438203988564;5448.536874365684;4723.315119307716;5749.7700091996685;5890.941090589082;5904.261967254093;5920.259967504062;6251.249850017982;6413.422791948747;6418.5507014509;6431.774887878949;6438.549301548894;6236.563440559163;6305.779297724557;6395.968020159916;6420.935790642127;6494.318096599836;6136.140940268366;6140.048292514667;6145.877082458326;6150.938490615126;6162.661053642048;6590.472762179014;6641.435477984329;6670.199576050905;6685.264620891698;6694.464442844561;6123.984276525971;6179.536534759911;6249.500039996789;6282.528810339243;6300.779472718433;5849.3858144894175;6281.057841323838;6289.339619339903;6301.96849015752;6418.8716225675225;6131.193168498027;6174.6912654368;6187.969060154761;6199.659018754011;6227.595206311576;6170.382961703794;6251.6561589112125;6268.153799237045;6293.559450838489;6299.6535190564955;5118.897622047538;5140.46025167352;5150.948490515122;5161.4322424533275;5164.147915593885;4464.129494748493;4606.953930460652;4634.21218392874;4670.556297151765;4676.719396836201;6017.357955396622;6082.148499210114;6190.721417536221;6201.348858369896;6211;6461.903071453932;6463.806085817433;6480.222373315138;6483.124778154889;6487.578307410004;5956.434138756811;6032.095185722177;6144.109104179869;6161.876762464725;6166.383361663888;5590.608657394025;5617.38208797032;5620.437956204347;5634.971825140848;5673.716314184274;6632.071509988606;6653.234877988996;6660.500462465237;6669.833254168685;6674.365935236145;5405.405405405324;6280.995040793451;6288.371162883675;6299.748010079546;6300.306966233619;6459.128017717736;6536.738530458919;6575.704093315717;6583.078369028436;6609.339066093352;6388.64862432552;6431.871362572816;6440.935590644033;6446;6452.645104519296;5386.326709161355;6229.096780966644;6298.1812364392335;6470.450011749054;6534.379233972765;6279.246490421178;6294.276158241861;6294.716737746904;6299.748010079546;6311.116443697794;6268.592541484789;6290.2766181889665;6293.685315734287;6316.715747791269;6331.9366806331345;5345.1982202669915;5590.245316882331;6071.605345652519;6149.938500614937;6256.593321434092;4949.727764972961;5122.948770512247;5148.871278218075;6166.969165154145;6203.906941395792;6004.609700369462;6038.5772995889865;6044.486218671462;6045.546584006305;6061.181740464981 08:33:57 INFO - 2015-11-20 08:33:57,750 DEBUG : BROWSER_OUTPUT: |1;ext.html;543.5352773378759;551.8620344913771;584.7310237290847;584.8303991842365;598.189453290791;41839.79080104599;42682.14635707284;42764;42789;42798;46252;46277;46524.53475465244;46800.765996170056;46934.76532617341;9795.167410770093;9877.802443951117;9981.201503879673;10006.049425304584;10012.349197302152;9772.778402699663;9844.803103937917;9858.16205622523;9881.110700036996;9895.356801807859;9833.606655733762;9880.25898057645;9913.256505762061;9917.305788594802;9940.5526751296;9840.3603765755;9900.851487227697;9909.009099090106;9917.504124793732;9930.106290433896;9718.70843874685;9817.558209880572;9844.95077524615;9853.655122070764;9864.161546268575;42343.57656423458;42390.57609423897;42798.71603851889;42901.4984475545;43094.353584696255;2808.255812209766;3194.0577529628818;3402.4045791986305;3647.215848592539;4134.772587507686;24757.5048499029;28883.711162888314;29828.955986540583;29838.85080574605;30062.947796827226;2716.8369897806197;2803.733645303693;2862.041216192578;2878.136559032303;2932.7067293270716;369758.6048279046;392616;398500.9999999971;440632;442234.9999999968;70281.94577081347;70613.94079088818;70802.64598677076;71068.57862842715;71231;73387.63306183435;74133.5173296531;74406;74626.25373746193;74775.87836182462;17017.82982170187;17258.309667613405;17398.56503587395;17520.824791752173;17570;13045.34773261333;13076;13105.672358191121;13158.473661053642;13226.933865330804;21590.352289431343;22226.777527236158;22284.44288892758;22378;22468.98889549974;8270.669173233124;8464.32285417165;8486.533240671699;8492.193241642035;8510.36172287081;937.9822892161944;938.1650331205233;1036.3471013261747;1101.3612104979093;1163.5352808319542;31002;31142.688573114432;31504.842475787475;31540.842295788832;31834.681653183634;1057.2123767793043;1063.2822844579878;1073.8281874900135;1080.3193987787643;1092.2136062035322;14757.557273281818;14871.405143794127;15101.169435681142;15185.696286074437;15238;559823;561175;561484;565809;566974.9907502781;60845.695771520855;60971.6951415249;61655.691721542;61699.6915015431;61839;1419.1910610951659;1432.906861054049;1434.3258668425824;1440;1585.8334874838206;29502.55746163766;30083.548746769255;31346.21634459157;31350.843245783624;31760.523592146597;55916.16125758035;56144;56261;56539.86920261654;56861;407714;411283;411948;413914;414495;32494.675053249164;33073.50389744108;33204.67181312721;33301.83349083239;33380.833095834365;46592.53407465882;46906.76546617245;46963.765181173876;47154;48520;39262.21475570415;39453.92085421572;39532.40701389539;39594.80202598969;40529.59470405258;38080.04799880025;38480.80759596184;38650;39167;39381.2123757529;36937;37024.70413535513;37252.441213382364;37711.81144094262;38878.02804929899;32605;33476.1630959228;33579;34099.7852469652;34534.827325864215;20943.476413089793;22529.77470225277;25225.495490090463;26060.087896923516;28637.570436443886 08:33:57 INFO - 2015-11-20 08:33:57,750 DEBUG : BROWSER_OUTPUT: |2;jquery.html;311.5575882247208;345.24047096387943;360.21293473759823;361.73954752578135;362.61381628565573;17028.574285642866;20071.598568028632;21195.364139075853;21412.678809817844;22583.870806459654;21162.788372116273;21407.14371425141;21729.78270217297;21771;21816.563668726616;5694.886102277952;5713.542916566665;5827.825165245049;5833.795817146401;5843.766249350021;5791.189233507313;5805.419458054182;5828.184054232411;5833.270841144857;5836.328822185439;5643.463870932255;5713.17159011943;5728.79949201778;5733.340665823421;5773.56698247631;5607.915881261784;5622.5100348407705;5648.943510564883;5649.209110724501;5654.349749778787;4902.313676085351;4911.435184953704;4914.877128071791;5277.70972596507;5460.208269800896;12989.025823063308;13208;13268.336583170803;23917.521649567087;26417.886569074428;2120.236714782677;2176.4341271269427;2224.7663995280423;2230.3309007297908;2260.276711452336;9614.807703845883;9903.405795652212;13190.60428187156;14526.910481713914;15799.289031993589;1773.485689150145;1779.9822001780076;1838.154448953483;1943.7375954246138;2111.4721319670084;109102;113446.43276783646;116273;116982.41508792486;118375.99999999914;20528.794712052986;20628.69056964147;20636.174553018012;20810.063547140417;20992.685109723367;13068.738625227632;13248.20510769357;13283.66790830237;13383.263920484273;24946.501069978498;8521.062683104978;8642.351823613255;8656.004559475741;8710.912890871137;8724.95637521821;8824.735257942271;8882.333824963154;8915.866262006075;8940.32947528938;9003.819923601492;3291.7037466628117;3842.8471458562876;3989.5611482737454;4438.423005009328;4460.910781784346;1560.859522642945;1824.6533158699804;1836.696945004086;1887.6790945539017;1894.1097684088456;352.7654110016861;417.9331306990867;769.288408222392;935.6023689931752;1038.2887721910515;11390.316581005167;11703.76592468163;11786.445388573275;11849.466773995191;11870.34713090771;435.0906605195157;436.26053838743024;437.16719649068574;441.492283873548;445.2786485892874;6113.633182009094;6169.784057557964;11491.712707182387;12068.09489288307;12102.33437160947;761726;767923;775532.3670144952;780521;782179.0891045622;128907;131915;132940.00589991157;133654.99999999805;135006;1199.6640940536663;1210.5218438716834;1217.6955761059735;1223.9265644061384;1229;18372.265109395474;19708.901455492633;20012.799232046124;20162;20234.79765202329;44871.55128448674;53305;53898.730506347216;54743;55979.44020559742;69865;69931.30068699247;70289.29710702828;71822;73101.26898731157;9786.706398807763;9850.261230407605;10042.297039207186;10064.194864410976;10081.395116293046;20010.59978800445;20323.08546115458;20655.967201639556;20743.58512829765;20985.790142098384;15814.841851581337;15976.840231598;16070.196490175678;16346.591335216715;16407.343706251617;15798;16004.839951600336;16055;16229.918850405673;16274.640177174007;16373.672526549164;16822.327106916076;16885.831141688424;17015;17169.48491545256;9658.90341096608;9697.175740062174;9956.601735930482;9984.450855203033;10008.899911000797;10284.331518451278;12311.322877241479;16120.193990300673;16311;16455.25951332169 08:33:57 INFO - 2015-11-20 08:33:57,754 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1523.6419441431262;1562.1330161760225;1886.8018858019916;1906.9702360725205;1939.2533874458334;7824.217578242187;7863.252990965863;8244.422890397675;8336.874946875794;8351.540665263408;8119.756407307776;8244.628991695374;8343.582820858948;8355.91644083559;8362.665493380273;2346.648002799581;2408.0608562660577;2414.8551086934754;2416.7583241675866;2424.987875060622;2400.9759902401015;2445.7921076708503;2460.225029115823;2462.91379801707;2470.5800013997664;2384.3681424422457;2388.164142550111;2414.782669559739;2419.661247425362;2429.2226487524;2373.774491423312;2397.928062158138;2416.492536567323;2426.551088048717;2427.9514409711796;2408.89159987801;2419.600765873629;2443.1693224303644;2445.254197469771;2455.0057226823164;8386.748397548023;8475.533845638487;8487.321014318839;8498.872516912252;8499.405041647087;4780.211265141247;5227.294315267466;5296.708681022542;5306.124489459235;5310.389305229871;3268.346330733863;3492.1095120744303;3520.8591656333715;3582.42681171014;3619.60184379718;1007.808516381885;1043.2853495355705;1071.5553045486115;1093.6828319787332;1095.1840878545454;10947;10978.835317470244;10981.725456863562;10984.956429139298;11021.228514004022;4314;4806.591439727662;4821.083994041121;4871.415430148405;4912.459629440758;9618.567164477616;9639.855402168972;9702.5148742564;9718.319717619841;9795.461249631197;5254.185601231815;5286.97356513215;5292.391374991926;5296.364436267596;5321.574274058066;4831.782569784368;4840.588549973221;4868.440129385095;4872.049950259736;4885.462599114095;3900.6684431823046;3903.941440878389;3925.862594809168;3925.8822235332987;3933.350997085449;1280.551806867589;1287.9034072444604;1288.6778305423645;1290.071148772882;1291.2704322058007;1328.6657649773197;1343.395472037587;1358.877701006914;1393.909395889264;1406.423366419763;7686.231376862269;7712.383009359238;7723.806904827425;7745.031871016123;7779.688812447439;420.4492115328929;494.61667207914155;508.0474111041797;513.7790749977546;513.9595804655512;5904.734286957011;6070.2412198475195;6071.089336599457;6086.939130608637;6112.724927378279;9515.57179926905;10074.194064474825;10315.1747860171;10322.948385258025;10375.688729338131;9746.951265243628;10132.544035518273;10146.391216526885;10149.289549731448;10243.692689219335;7956.562389068541;7988.720394786154;8003.719869804529;8017.719379821795;8096.068952070469;7822.256885595859;7823.608819558885;7877.684892604231;7918.564478953713;7928.960355198187;9097.49963752;9268.304877134107;9272.350935434455;9275.07249275067;9286;9261.953690231776;9437.669681561387;9446.24430045581;9498.905010949802;9513.668086468038;7328.120625524971;7359.227281135403;7444.143923448873;7462.664180112017;7466.887996680162;8025.438219324591;8060.39547033963;8108.027036755627;8114.148014458633;8114.675412983414;7371.705131794668;7485.7754267372065;7487.138979017265;7582.052243469567;7613.314801667876;7340.559566425818;7413.481056326221;7423.109226892808;7438.144613369315;7482.663280152297;7513.173550909286;7542.245775422414;7572.545647261182;7574.81062973408;7615.162332143571;6840.144981877265;6842.623655698984;6857.348551887562;6864.141982252218;6873.862522749617;6941.583504989717;6946.409555187865;6969.686364113526;6982.162140542964;7082.822929426806 08:33:57 INFO - 2015-11-20 08:33:57,755 DEBUG : BROWSER_OUTPUT: |4;prototype.html;290.30182411300825;328.1746407784421;332.27563910674735;332.506228251047;335.9395308844407;6936.410405115565;6989.930100698992;7101.928980710191;7149.571025738459;7213.675384607692;6967.512274140812;6970.16358037035;7011.964940175292;7058.082449281586;7063.223045464994;4157.52188498322;4660.883477913062;4952.900941981158;5027.773750181251;5035.370578677665;5100.234964755279;5102.668326558781;5105.472790968476;5118.4113826909825;5160.845174644748;4117.60882716143;5068.960863023071;5071.543561079502;5073.568746656539;5094.872628184306;4351.804168812395;4852.150873597124;5087.338645976037;5097.872553186163;5099.59203263738;4227.957720422787;4326.8269269229195;4342.630876375511;4345.06581085065;4349.369341445473;6609.735610575572;6632;6647.202335719745;6659.800205993828;6676.031975363545;5944.554158438134;5949.167116603679;5951.256092988377;5961.463468287831;5966.552508561876;7189.640517974132;7388.556686598768;7398.482106252564;7418.629068546605;7429.925700742978;4478.57453541913;4866.31871537985;4867.2212446008825;4873.707577545323;4876.756162191876;7739.535627862347;7848.13670496245;7876.52740835546;7890.605469726548;7922.960385198037;4743.857684269477;4952.504749525018;4957.975210123926;4959.454460009396;4970.950290497121;5045.772940217699;5049.6212784041345;5055.317532133188;5059.56993655536;5061.848144555595;5960.791372301948;5974.820755377345;5980.581359304807;5990.580659353804;6003.729832157564;7270.781876543712;7451.844964030584;7461.552306861606;7462.514936529108;7463.738769143054;1749.2740512687346;1776.2273411066228;1776.422662634649;1776.644671065792;1780.6972814621545;1038.5949479702922;1137.8236373362142;1141.1498433666804;1147.942602869853;1157.7915975124558;6300.527460440485;6647.235567909753;7115.217326094125;7129.607871567114;7225.132984041844;7830.3735701144915;7904.051513818378;7917.406194535433;7926.524408535506;7956.761297161094;6229.221347331583;7190.96404517974;7197.208307086216;7206.711731530785;7213.49505534618;4003.579624139482;4148.79256037197;4152.522459917148;4157.812898419578;4169.520505141887;7074.964625176841;7212.891806622905;8076.959615201887;8112.472689275178;8191.467554608931;7822.765317040498;8081.838363232702;8091.514509129471;8095.797605059921;8111.148329425326;6783.423409010289;7089.751858684921;8068.7175948841505;8097.473664211808;8120.269175774209;7811.375089992901;7814.570198638902;7848.803779905548;7855.921440785748;7870.5671188082915;6725.596464212163;6901.033855260167;7066.152061752623;7691.923080769121;7754.612269386621;7523.210062943313;8162.265396114378;8192.139825318494;8195.549244791593;8214.26071653554;4745.264484004984;4784.40194975628;4785.330053792402;4785.330053792402;4787.61699064081;7601.885971710318;7789.415793815373;7800.921990780246;7817.804554886174;7856.45004849655;7478.252174782696;7491.138519070377;7500.362469189961;7530.510516816389;7539.132999705104;7306.59813710251;7514.62426878643;7519.511231769918;7519.962400187964;7537.2462753724185;6772.830679233059;7159.749408770668;7281.344678978918;7313.67088481009;7317.451191160791;6095.085737139465;6233.883058470765;7187.41876787106;7430.702771889064;7471.850562988601;6455.580387274812;7337.853242935218;7370.742024029133;7374.1151061872915;7389.519681220703 08:33:57 INFO - 2015-11-20 08:33:57,757 DEBUG : BROWSER_OUTPUT: |5;yui.html;684.777447329618;760.6919197724922;801.9639116239769;823.098706915927;851.9691173679847;15029.173395463245;15171.92414037931;15397.6150596235;15405.075695458267;15456.304466299016;13994.370253338599;14618.634534136652;14659.63350916225;14661.853381466182;14679.706405871877;931.2643012020529;940.0458534587399;943.575391074016;958.7075941837737;960.0831206198064;952.033685808901;960.2174228004154;960.4045491795061;964.4936408385619;968.4818622037211;993.2600212841443;1002.7493126718321;1006.0342071611262;1007.7732510185223;1012.6607586458546;992.2508506077937;996.3971797062782;1001.4792307999872;1007.4811472091878;1007.50632190227;739.2865884421559;753.1865585168006;753.6834529497625;754.4982586579918;756.1984296645574;15394.923025384913;15434.305456254495;15538.223088845625;15551;15568.131824181171;10973.177011724072;12489.18820276679;12492.00127979528;12551.246925184427;12566.81149782754;10126.240531960133;10248.282620216587;10311.226658000605;10322.593534144811;10337.586496540129;3491.476278558211;3510.6313837047255;3533.0460775590705;3537.6462353764673;3542.397792375277;84572;85067.99999999937;85695;85919;86019.56990215072;9579.952100239454;9623.855642165374;9635.98822123681;9727.13303197126;9871.75320616976;21664.891675541836;21715.78284217169;21795.782042179377;21826.236081737065;21846.45383865416;7331.633418329062;7439.032925719622;7625.275598818103;7642.579658118857;7764.262395072459;4125.278076336629;4224.746515209097;4227.175700738388;4250.893727656833;4360.41134446852;3600.873969411058;3604.5494313210847;3606.3328284267495;3616.132128289244;3635.2729454109285;589.104561067184;602.524006035236;611.0986295214523;633.0504243634548;668.5854770042605;589.0839744197814;607.9240094988127;612.8023042161249;632.6109442692803;633;8523.829523409497;8751.124887511198;8814.77963050916;8914.955425222832;9483.47840868745;511.97440127994196;554.4040156831422;562.2774734466192;582.5630776917312;598.1595857819771;4440.955590444119;4447.933281000787;4534.206513860061;4549.249373853343;4603.217453032992;96179;96288.55567166499;97003;99806;106322;81339.59330203429;82514;82844.58577707072;84492.57753711192;87750;77668;78184.60907695425;78297;78383.60808196037;80031.19968800354;8973.82052358936;8999.370044097112;9043.457392556467;9190.356675032683;9302.627894884128;51824.704382390744;52086.73956630193;52657;52894.20658690199;53090.46909530855;79558;79885.60057199677;79924.60037699774;80037;80552;10836.187285953743;11016.724581885517;11026.614068507884;11376.772464550828;11932.582359617372;12264.632061038183;12311.630651080482;12549.623511294676;12557.74884502323;12740;11689.766204676029;11727.061835053004;11765.941170294094;11810.468528916392;11893.643190704293;11813.645590632295;11817.290962542274;11823;11941.343226122646;11954.521819127138;11428.542858285575;11576.652700419001;11664.066874650178;11736.0611151106;11774.3524106175;9789.755256118655;10010.799784004425;10237.74405639865;10257.076863082359;10384.896151038694;8174.386920981069;8767.29861611057;9861.654842080492;9899.257555683209;9900.405975641484 08:33:57 INFO - 2015-11-20 08:33:57,757 DEBUG : BROWSER_OUTPUT: __end_tp_report 08:33:57 INFO - 2015-11-20 08:33:57,757 DEBUG : BROWSER_OUTPUT: __start_cc_report 08:33:57 INFO - 2015-11-20 08:33:57,757 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,350 08:33:57 INFO - 2015-11-20 08:33:57,757 DEBUG : BROWSER_OUTPUT: __end_cc_report 08:33:57 INFO - 2015-11-20 08:33:57,757 DEBUG : BROWSER_OUTPUT: __startTimestamp1448037237743__endTimestamp 08:33:57 INFO - 2015-11-20 08:33:57,758 DEBUG : BROWSER_OUTPUT: 08:33:57 INFO - 2015-11-20 08:33:57,758 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 08:33:57 INFO - 2015-11-20 08:33:57,758 DEBUG : BROWSER_OUTPUT: Number of tests: 6 08:33:57 INFO - 2015-11-20 08:33:57,758 DEBUG : BROWSER_OUTPUT: 08:33:57 INFO - 2015-11-20 08:33:57,758 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5844.18 Median:6144.11 stddev:825.87 (13.4%) stddev-sans-first:799.72 08:33:57 INFO - 2015-11-20 08:33:57,758 DEBUG : BROWSER_OUTPUT: Values: 3093.8 3215.5 3499.4 3587.0 3595.4 6046.6 6047.5 6069.1 6098.7 6134.2 4681.5 5805.7 5969.3 6027.4 6122.9 4704.6 5351.5 5410.9 5456.5 5475.5 199.4 4767.5 5209.2 5521.9 5598.9 5014.9 5399.9 5415.3 5429.6 5488.2 5444.6 5448.2 5460.5 5469.9 5503.6 4452.4 5208.2 5217.1 5350.4 5448.5 4723.3 5749.8 5890.9 5904.3 5920.3 6251.2 6413.4 6418.6 6431.8 6438.5 6236.6 6305.8 6396.0 6420.9 6494.3 6136.1 6140.0 6145.9 6150.9 6162.7 6590.5 6641.4 6670.2 6685.3 6694.5 6124.0 6179.5 6249.5 6282.5 6300.8 5849.4 6281.1 6289.3 6302.0 6418.9 6131.2 6174.7 6188.0 6199.7 6227.6 6170.4 6251.7 6268.2 6293.6 6299.7 5118.9 5140.5 5150.9 5161.4 5164.1 4464.1 4607.0 4634.2 4670.6 4676.7 6017.4 6082.1 6190.7 6201.3 6211.0 6461.9 6463.8 6480.2 6483.1 6487.6 5956.4 6032.1 6144.1 6161.9 6166.4 5590.6 5617.4 5620.4 5635.0 5673.7 6632.1 6653.2 6660.5 6669.8 6674.4 5405.4 6281.0 6288.4 6299.7 6300.3 6459.1 6536.7 6575.7 6583.1 6609.3 6388.6 6431.9 6440.9 6446.0 6452.6 5386.3 6229.1 6298.2 6470.5 6534.4 6279.2 6294.3 6294.7 6299.7 6311.1 6268.6 6290.3 6293.7 6316.7 6331.9 5345.2 5590.2 6071.6 6149.9 6256.6 4949.7 5122.9 5148.9 6167.0 6203.9 6004.6 6038.6 6044.5 6045.5 6061.2 08:33:57 INFO - 2015-11-20 08:33:57,758 DEBUG : BROWSER_OUTPUT: 08:33:57 INFO - 2015-11-20 08:33:57,758 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:62772.70 Median:219515.30 stddev:123957.66 (56.5%) stddev-sans-first:124217.34 08:33:57 INFO - 2015-11-20 08:33:57,759 DEBUG : BROWSER_OUTPUT: Values: 543.5 551.9 584.7 584.8 598.2 41839.8 42682.1 42764.0 42789.0 42798.0 46252.0 46277.0 46524.5 46800.8 46934.8 9795.2 9877.8 9981.2 10006.0 10012.3 9772.8 9844.8 9858.2 9881.1 9895.4 9833.6 9880.3 9913.3 9917.3 9940.6 9840.4 9900.9 9909.0 9917.5 9930.1 9718.7 9817.6 9845.0 9853.7 9864.2 42343.6 42390.6 42798.7 42901.5 43094.4 2808.3 3194.1 3402.4 3647.2 4134.8 24757.5 28883.7 29829.0 29838.9 30062.9 2716.8 2803.7 2862.0 2878.1 2932.7 369758.6 392616.0 398501.0 440632.0 442235.0 70281.9 70613.9 70802.6 71068.6 71231.0 73387.6 74133.5 74406.0 74626.3 74775.9 17017.8 17258.3 17398.6 17520.8 17570.0 13045.3 13076.0 13105.7 13158.5 13226.9 21590.4 22226.8 22284.4 22378.0 22469.0 8270.7 8464.3 8486.5 8492.2 8510.4 938.0 938.2 1036.3 1101.4 1163.5 31002.0 31142.7 31504.8 31540.8 31834.7 1057.2 1063.3 1073.8 1080.3 1092.2 14757.6 14871.4 15101.2 15185.7 15238.0 559823.0 561175.0 561484.0 565809.0 566975.0 60845.7 60971.7 61655.7 61699.7 61839.0 1419.2 1432.9 1434.3 1440.0 1585.8 29502.6 30083.5 31346.2 31350.8 31760.5 55916.2 56144.0 56261.0 56539.9 56861.0 407714.0 411283.0 411948.0 413914.0 414495.0 32494.7 33073.5 33204.7 33301.8 33380.8 46592.5 46906.8 46963.8 47154.0 48520.0 39262.2 39453.9 39532.4 39594.8 40529.6 38080.0 38480.8 38650.0 39167.0 39381.2 36937.0 37024.7 37252.4 37711.8 38878.0 32605.0 33476.2 33579.0 34099.8 34534.8 20943.5 22529.8 25225.5 26060.1 28637.6 08:33:57 INFO - 2015-11-20 08:33:57,760 DEBUG : BROWSER_OUTPUT: 08:33:57 INFO - 2015-11-20 08:33:57,760 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:40452.98 Median:11953.11 stddev:127595.77 (1067.5%) stddev-sans-first:127918.11 08:33:57 INFO - 2015-11-20 08:33:57,761 DEBUG : BROWSER_OUTPUT: Values: 311.6 345.2 360.2 361.7 362.6 17028.6 20071.6 21195.4 21412.7 22583.9 21162.8 21407.1 21729.8 21771.0 21816.6 5694.9 5713.5 5827.8 5833.8 5843.8 5791.2 5805.4 5828.2 5833.3 5836.3 5643.5 5713.2 5728.8 5733.3 5773.6 5607.9 5622.5 5648.9 5649.2 5654.3 4902.3 4911.4 4914.9 5277.7 5460.2 12989.0 13208.0 13268.3 23917.5 26417.9 2120.2 2176.4 2224.8 2230.3 2260.3 9614.8 9903.4 13190.6 14526.9 15799.3 1773.5 1780.0 1838.2 1943.7 2111.5 109102.0 113446.4 116273.0 116982.4 118376.0 20528.8 20628.7 20636.2 20810.1 20992.7 13068.7 13248.2 13283.7 13383.3 24946.5 8521.1 8642.4 8656.0 8710.9 8725.0 8824.7 8882.3 8915.9 8940.3 9003.8 3291.7 3842.8 3989.6 4438.4 4460.9 1560.9 1824.7 1836.7 1887.7 1894.1 352.8 417.9 769.3 935.6 1038.3 11390.3 11703.8 11786.4 11849.5 11870.3 435.1 436.3 437.2 441.5 445.3 6113.6 6169.8 11491.7 12068.1 12102.3 761726.0 767923.0 775532.4 780521.0 782179.1 128907.0 131915.0 132940.0 133655.0 135006.0 1199.7 1210.5 1217.7 1223.9 1229.0 18372.3 19708.9 20012.8 20162.0 20234.8 44871.6 53305.0 53898.7 54743.0 55979.4 69865.0 69931.3 70289.3 71822.0 73101.3 9786.7 9850.3 10042.3 10064.2 10081.4 20010.6 20323.1 20656.0 20743.6 20985.8 15814.8 15976.8 16070.2 16346.6 16407.3 15798.0 16004.8 16055.0 16229.9 16274.6 16373.7 16822.3 16885.8 17015.0 17169.5 9658.9 9697.2 9956.6 9984.5 10008.9 10284.3 12311.3 16120.2 16311.0 16455.3 08:33:57 INFO - 2015-11-20 08:33:57,761 DEBUG : BROWSER_OUTPUT: 08:33:57 INFO - 2015-11-20 08:33:57,761 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5874.74 Median:5308.26 stddev:3038.33 (57.2%) stddev-sans-first:3029.25 08:33:57 INFO - 2015-11-20 08:33:57,762 DEBUG : BROWSER_OUTPUT: Values: 1523.6 1562.1 1886.8 1907.0 1939.3 7824.2 7863.3 8244.4 8336.9 8351.5 8119.8 8244.6 8343.6 8355.9 8362.7 2346.6 2408.1 2414.9 2416.8 2425.0 2401.0 2445.8 2460.2 2462.9 2470.6 2384.4 2388.2 2414.8 2419.7 2429.2 2373.8 2397.9 2416.5 2426.6 2428.0 2408.9 2419.6 2443.2 2445.3 2455.0 8386.7 8475.5 8487.3 8498.9 8499.4 4780.2 5227.3 5296.7 5306.1 5310.4 3268.3 3492.1 3520.9 3582.4 3619.6 1007.8 1043.3 1071.6 1093.7 1095.2 10947.0 10978.8 10981.7 10985.0 11021.2 4314.0 4806.6 4821.1 4871.4 4912.5 9618.6 9639.9 9702.5 9718.3 9795.5 5254.2 5287.0 5292.4 5296.4 5321.6 4831.8 4840.6 4868.4 4872.0 4885.5 3900.7 3903.9 3925.9 3925.9 3933.4 1280.6 1287.9 1288.7 1290.1 1291.3 1328.7 1343.4 1358.9 1393.9 1406.4 7686.2 7712.4 7723.8 7745.0 7779.7 420.4 494.6 508.0 513.8 514.0 5904.7 6070.2 6071.1 6086.9 6112.7 9515.6 10074.2 10315.2 10322.9 10375.7 9747.0 10132.5 10146.4 10149.3 10243.7 7956.6 7988.7 8003.7 8017.7 8096.1 7822.3 7823.6 7877.7 7918.6 7929.0 9097.5 9268.3 9272.4 9275.1 9286.0 9262.0 9437.7 9446.2 9498.9 9513.7 7328.1 7359.2 7444.1 7462.7 7466.9 8025.4 8060.4 8108.0 8114.1 8114.7 7371.7 7485.8 7487.1 7582.1 7613.3 7340.6 7413.5 7423.1 7438.1 7482.7 7513.2 7542.2 7572.5 7574.8 7615.2 6840.1 6842.6 6857.3 6864.1 6873.9 6941.6 6946.4 6969.7 6982.2 7082.8 08:33:57 INFO - 2015-11-20 08:33:57,763 DEBUG : BROWSER_OUTPUT: 08:33:57 INFO - 2015-11-20 08:33:57,763 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:6070.00 Median:6951.96 stddev:1958.81 (28.2%) stddev-sans-first:1915.67 08:33:57 INFO - 2015-11-20 08:33:57,764 DEBUG : BROWSER_OUTPUT: Values: 290.3 328.2 332.3 332.5 335.9 6936.4 6989.9 7101.9 7149.6 7213.7 6967.5 6970.2 7012.0 7058.1 7063.2 4157.5 4660.9 4952.9 5027.8 5035.4 5100.2 5102.7 5105.5 5118.4 5160.8 4117.6 5069.0 5071.5 5073.6 5094.9 4351.8 4852.2 5087.3 5097.9 5099.6 4228.0 4326.8 4342.6 4345.1 4349.4 6609.7 6632.0 6647.2 6659.8 6676.0 5944.6 5949.2 5951.3 5961.5 5966.6 7189.6 7388.6 7398.5 7418.6 7429.9 4478.6 4866.3 4867.2 4873.7 4876.8 7739.5 7848.1 7876.5 7890.6 7923.0 4743.9 4952.5 4958.0 4959.5 4971.0 5045.8 5049.6 5055.3 5059.6 5061.8 5960.8 5974.8 5980.6 5990.6 6003.7 7270.8 7451.8 7461.6 7462.5 7463.7 1749.3 1776.2 1776.4 1776.6 1780.7 1038.6 1137.8 1141.1 1147.9 1157.8 6300.5 6647.2 7115.2 7129.6 7225.1 7830.4 7904.1 7917.4 7926.5 7956.8 6229.2 7191.0 7197.2 7206.7 7213.5 4003.6 4148.8 4152.5 4157.8 4169.5 7075.0 7212.9 8077.0 8112.5 8191.5 7822.8 8081.8 8091.5 8095.8 8111.1 6783.4 7089.8 8068.7 8097.5 8120.3 7811.4 7814.6 7848.8 7855.9 7870.6 6725.6 6901.0 7066.2 7691.9 7754.6 7523.2 8162.3 8192.1 8195.5 8214.3 4745.3 4784.4 4785.3 4785.3 4787.6 7601.9 7789.4 7800.9 7817.8 7856.5 7478.3 7491.1 7500.4 7530.5 7539.1 7306.6 7514.6 7519.5 7520.0 7537.2 6772.8 7159.7 7281.3 7313.7 7317.5 6095.1 6233.9 7187.4 7430.7 7471.9 6455.6 7337.9 7370.7 7374.1 7389.5 08:33:57 INFO - 2015-11-20 08:33:57,764 DEBUG : BROWSER_OUTPUT: 08:33:57 INFO - 2015-11-20 08:33:57,764 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:19605.25 Median:52775.60 stddev:28133.92 (53.3%) stddev-sans-first:28176.97 08:33:57 INFO - 2015-11-20 08:33:57,765 DEBUG : BROWSER_OUTPUT: Values: 684.8 760.7 802.0 823.1 852.0 15029.2 15171.9 15397.6 15405.1 15456.3 13994.4 14618.6 14659.6 14661.9 14679.7 931.3 940.0 943.6 958.7 960.1 952.0 960.2 960.4 964.5 968.5 993.3 1002.7 1006.0 1007.8 1012.7 992.3 996.4 1001.5 1007.5 1007.5 739.3 753.2 753.7 754.5 756.2 15394.9 15434.3 15538.2 15551.0 15568.1 10973.2 12489.2 12492.0 12551.2 12566.8 10126.2 10248.3 10311.2 10322.6 10337.6 3491.5 3510.6 3533.0 3537.6 3542.4 84572.0 85068.0 85695.0 85919.0 86019.6 9580.0 9623.9 9636.0 9727.1 9871.8 21664.9 21715.8 21795.8 21826.2 21846.5 7331.6 7439.0 7625.3 7642.6 7764.3 4125.3 4224.7 4227.2 4250.9 4360.4 3600.9 3604.5 3606.3 3616.1 3635.3 589.1 602.5 611.1 633.1 668.6 589.1 607.9 612.8 632.6 633.0 8523.8 8751.1 8814.8 8915.0 9483.5 512.0 554.4 562.3 582.6 598.2 4441.0 4447.9 4534.2 4549.2 4603.2 96179.0 96288.6 97003.0 99806.0 106322.0 81339.6 82514.0 82844.6 84492.6 87750.0 77668.0 78184.6 78297.0 78383.6 80031.2 8973.8 8999.4 9043.5 9190.4 9302.6 51824.7 52086.7 52657.0 52894.2 53090.5 79558.0 79885.6 79924.6 80037.0 80552.0 10836.2 11016.7 11026.6 11376.8 11932.6 12264.6 12311.6 12549.6 12557.7 12740.0 11689.8 11727.1 11765.9 11810.5 11893.6 11813.6 11817.3 11823.0 11941.3 11954.5 11428.5 11576.7 11664.1 11736.1 11774.4 9789.8 10010.8 10237.7 10257.1 10384.9 8174.4 8767.3 9861.7 9899.3 9900.4 08:33:57 INFO - 2015-11-20 08:33:57,766 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 08:33:57 INFO - 2015-11-20 08:33:57,766 DEBUG : BROWSER_OUTPUT: 08:33:58 INFO - 2015-11-20 08:33:58,152 INFO : Browser exited with error code: 0 08:33:58 INFO - 2015-11-20 08:33:58,177 INFO : Completed test dromaeo_css (00:18:29) 08:33:58 INFO - 2015-11-20 08:33:58,177 INFO : Starting test kraken 08:33:58 INFO - 2015-11-20 08:33:58,177 DEBUG : operating with platform_type : mac_ 08:33:58 INFO - 2015-11-20 08:33:58,177 INFO : Initialising browser for kraken test... 08:33:58 INFO - 2015-11-20 08:33:58,189 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/tmprTU1YA/profile http://localhost:49536/getInfo.html 08:34:00 INFO - 2015-11-20 08:34:00,859 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 08:34:00 INFO - 2015-11-20 08:34:00,860 DEBUG : BROWSER_OUTPUT: colorDepth:24 08:34:00 INFO - 2015-11-20 08:34:00,860 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 08:34:00 INFO - 2015-11-20 08:34:00,860 DEBUG : BROWSER_OUTPUT: __metrics 08:34:01 INFO - 2015-11-20 08:34:01,442 INFO : Browser initialized. 08:34:01 INFO - 2015-11-20 08:34:01,442 INFO : Running cycle 1/1 for kraken test... 08:34:01 INFO - 2015-11-20 08:34:01,442 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/tmprTU1YA/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 08:34:13 INFO - 2015-11-20 08:34:13,290 DEBUG : BROWSER_OUTPUT: RSS: Main: 236351488 08:34:13 INFO - 2015-11-20 08:34:13,290 DEBUG : BROWSER_OUTPUT: 08:34:16 INFO - 2015-11-20 08:34:16,310 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49536/tests/kraken/driver.html?testName=audio-beat-detection) 08:34:16 INFO - 2015-11-20 08:34:16,935 DEBUG : BROWSER_OUTPUT: RSS: Main: 248868864 08:34:16 INFO - 2015-11-20 08:34:16,935 DEBUG : BROWSER_OUTPUT: 08:34:19 INFO - 2015-11-20 08:34:19,484 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49536/tests/kraken/driver.html?testName=audio-dft) 08:34:20 INFO - 2015-11-20 08:34:20,088 DEBUG : BROWSER_OUTPUT: RSS: Main: 259117056 08:34:20 INFO - 2015-11-20 08:34:20,088 DEBUG : BROWSER_OUTPUT: 08:34:23 INFO - 2015-11-20 08:34:23,278 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49536/tests/kraken/driver.html?testName=audio-fft) 08:34:23 INFO - 2015-11-20 08:34:23,850 DEBUG : BROWSER_OUTPUT: RSS: Main: 261746688 08:34:23 INFO - 2015-11-20 08:34:23,850 DEBUG : BROWSER_OUTPUT: 08:34:25 INFO - 2015-11-20 08:34:25,727 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49536/tests/kraken/driver.html?testName=audio-oscillator) 08:34:26 INFO - 2015-11-20 08:34:26,331 DEBUG : BROWSER_OUTPUT: RSS: Main: 262283264 08:34:26 INFO - 2015-11-20 08:34:26,331 DEBUG : BROWSER_OUTPUT: 08:34:28 INFO - 2015-11-20 08:34:28,368 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49536/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:34:28 INFO - 2015-11-20 08:34:28,951 DEBUG : BROWSER_OUTPUT: RSS: Main: 264183808 08:34:28 INFO - 2015-11-20 08:34:28,951 DEBUG : BROWSER_OUTPUT: 08:34:31 INFO - 2015-11-20 08:34:31,714 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49536/tests/kraken/driver.html?testName=imaging-darkroom) 08:34:32 INFO - 2015-11-20 08:34:32,304 DEBUG : BROWSER_OUTPUT: RSS: Main: 265687040 08:34:32 INFO - 2015-11-20 08:34:32,304 DEBUG : BROWSER_OUTPUT: 08:34:35 INFO - 2015-11-20 08:34:35,126 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49536/tests/kraken/driver.html?testName=imaging-desaturate) 08:34:35 INFO - 2015-11-20 08:34:35,718 DEBUG : BROWSER_OUTPUT: RSS: Main: 265687040 08:34:35 INFO - 2015-11-20 08:34:35,719 DEBUG : BROWSER_OUTPUT: 08:34:38 INFO - 2015-11-20 08:34:38,768 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49536/tests/kraken/driver.html?testName=json-parse-financial) 08:34:39 INFO - 2015-11-20 08:34:39,357 DEBUG : BROWSER_OUTPUT: RSS: Main: 263794688 08:34:39 INFO - 2015-11-20 08:34:39,357 DEBUG : BROWSER_OUTPUT: 08:34:40 INFO - 2015-11-20 08:34:40,875 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49536/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:34:41 INFO - 2015-11-20 08:34:41,458 DEBUG : BROWSER_OUTPUT: RSS: Main: 262926336 08:34:41 INFO - 2015-11-20 08:34:41,459 DEBUG : BROWSER_OUTPUT: 08:34:43 INFO - 2015-11-20 08:34:43,233 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49536/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:34:43 INFO - 2015-11-20 08:34:43,854 DEBUG : BROWSER_OUTPUT: RSS: Main: 264761344 08:34:43 INFO - 2015-11-20 08:34:43,854 DEBUG : BROWSER_OUTPUT: 08:34:45 INFO - 2015-11-20 08:34:45,939 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49536/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:34:46 INFO - 2015-11-20 08:34:46,530 DEBUG : BROWSER_OUTPUT: RSS: Main: 265011200 08:34:46 INFO - 2015-11-20 08:34:46,530 DEBUG : BROWSER_OUTPUT: 08:34:49 INFO - 2015-11-20 08:34:49,048 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49536/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:34:49 INFO - 2015-11-20 08:34:49,664 DEBUG : BROWSER_OUTPUT: RSS: Main: 264429568 08:34:49 INFO - 2015-11-20 08:34:49,665 DEBUG : BROWSER_OUTPUT: 08:34:52 INFO - 2015-11-20 08:34:52,201 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49536/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:34:52 INFO - 2015-11-20 08:34:52,787 DEBUG : BROWSER_OUTPUT: RSS: Main: 265027584 08:34:52 INFO - 2015-11-20 08:34:52,787 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,413 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49536/tests/kraken/driver.html?testName=ai-astar) 08:34:54 INFO - 2015-11-20 08:34:54,670 DEBUG : BROWSER_OUTPUT: RSS: Main: 265093120 08:34:54 INFO - 2015-11-20 08:34:54,670 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,670 DEBUG : BROWSER_OUTPUT: __start_tp_report 08:34:54 INFO - 2015-11-20 08:34:54,670 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 08:34:54 INFO - 2015-11-20 08:34:54,670 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 08:34:54 INFO - 2015-11-20 08:34:54,670 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 08:34:54 INFO - 2015-11-20 08:34:54,670 DEBUG : BROWSER_OUTPUT: |0;ai-astar;115;116;167;164;147;183;153;115;115;116 08:34:54 INFO - 2015-11-20 08:34:54,670 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;146;123;144;157;120;143;141;119;160;146 08:34:54 INFO - 2015-11-20 08:34:54,670 DEBUG : BROWSER_OUTPUT: |2;audio-dft;192;188;197;200;223;198;198;196;201;195 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: |3;audio-fft;59;80;72;106;57;55;58;60;118;78 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;77;76;108;75;76;77;93;105;111;147 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;108;133;86;87;89;88;87;88;88;91 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;98;149;95;97;95;96;102;95;92;96 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;91;90;132;145;147;91;94;100;137;147 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;60;60;60;60;58;58;58;67;60;58 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;66;66;66;66;67;68;68;69;68;72 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;78;94;108;96;84;82;86;84;86;83 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;122;155;129;120;121;125;129;121;109;134 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;145;139;143;139;140;125;168;172;179;140 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;66;66;66;67;68;67;66;66;67;65 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: __end_tp_report 08:34:54 INFO - 2015-11-20 08:34:54,671 DEBUG : BROWSER_OUTPUT: __start_cc_report 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,818 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: __end_cc_report 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: __startTimestamp1448037294664__endTimestamp 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: Number of tests: 14 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:139.10 Median:150.00 stddev:26.65 (17.8%) stddev-sans-first:26.80 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: Values: 115.0 116.0 167.0 164.0 147.0 183.0 153.0 115.0 115.0 116.0 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:139.90 Median:145.00 stddev:14.59 (10.1%) stddev-sans-first:15.31 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: Values: 146.0 123.0 144.0 157.0 120.0 143.0 141.0 119.0 160.0 146.0 08:34:54 INFO - 2015-11-20 08:34:54,672 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:198.80 Median:198.00 stddev:9.32 (4.7%) stddev-sans-first:9.55 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: Values: 192.0 188.0 197.0 200.0 223.0 198.0 198.0 196.0 201.0 195.0 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:74.30 Median:59.50 stddev:21.96 (36.9%) stddev-sans-first:22.59 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: Values: 59.0 80.0 72.0 106.0 57.0 55.0 58.0 60.0 118.0 78.0 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:94.50 Median:76.00 stddev:23.57 (31.0%) stddev-sans-first:24.14 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: Values: 77.0 76.0 108.0 75.0 76.0 77.0 93.0 105.0 111.0 147.0 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:94.50 Median:88.00 stddev:14.98 (17.0%) stddev-sans-first:15.07 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: Values: 108.0 133.0 86.0 87.0 89.0 88.0 87.0 88.0 88.0 91.0 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,673 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:101.50 Median:95.50 stddev:16.89 (17.7%) stddev-sans-first:17.86 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: Values: 98.0 149.0 95.0 97.0 95.0 96.0 102.0 95.0 92.0 96.0 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:117.40 Median:118.50 stddev:26.05 (22.0%) stddev-sans-first:25.82 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: Values: 91.0 90.0 132.0 145.0 147.0 91.0 94.0 100.0 137.0 147.0 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:59.90 Median:60.00 stddev:2.69 (4.5%) stddev-sans-first:2.85 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: Values: 60.0 60.0 60.0 60.0 58.0 58.0 58.0 67.0 60.0 58.0 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.60 Median:68.00 stddev:1.90 (2.8%) stddev-sans-first:1.92 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: Values: 66.0 66.0 66.0 66.0 67.0 68.0 68.0 69.0 68.0 72.0 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:88.10 Median:85.00 stddev:8.82 (10.4%) stddev-sans-first:8.57 08:34:54 INFO - 2015-11-20 08:34:54,674 DEBUG : BROWSER_OUTPUT: Values: 78.0 94.0 108.0 96.0 84.0 82.0 86.0 84.0 86.0 83.0 08:34:54 INFO - 2015-11-20 08:34:54,675 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,675 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:126.50 Median:127.00 stddev:12.08 (9.5%) stddev-sans-first:12.70 08:34:54 INFO - 2015-11-20 08:34:54,675 DEBUG : BROWSER_OUTPUT: Values: 122.0 155.0 129.0 120.0 121.0 125.0 129.0 121.0 109.0 134.0 08:34:54 INFO - 2015-11-20 08:34:54,675 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,675 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:149.00 Median:144.00 stddev:17.58 (12.2%) stddev-sans-first:18.58 08:34:54 INFO - 2015-11-20 08:34:54,675 DEBUG : BROWSER_OUTPUT: Values: 145.0 139.0 143.0 139.0 140.0 125.0 168.0 172.0 179.0 140.0 08:34:54 INFO - 2015-11-20 08:34:54,675 DEBUG : BROWSER_OUTPUT: 08:34:54 INFO - 2015-11-20 08:34:54,675 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.40 Median:66.50 stddev:0.84 (1.3%) stddev-sans-first:0.88 08:34:54 INFO - 2015-11-20 08:34:54,675 DEBUG : BROWSER_OUTPUT: Values: 66.0 66.0 66.0 67.0 68.0 67.0 66.0 66.0 67.0 65.0 08:34:54 INFO - 2015-11-20 08:34:54,675 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 08:34:54 INFO - 2015-11-20 08:34:54,675 DEBUG : BROWSER_OUTPUT: 08:34:55 INFO - 2015-11-20 08:34:55,302 INFO : Browser exited with error code: 0 08:34:55 INFO - 2015-11-20 08:34:55,349 INFO : Completed test kraken (00:00:57) 08:34:55 INFO - 2015-11-20 08:34:55,349 INFO : Starting test v8_7 08:34:55 INFO - 2015-11-20 08:34:55,349 DEBUG : operating with platform_type : mac_ 08:34:55 INFO - 2015-11-20 08:34:55,349 INFO : Initialising browser for v8_7 test... 08:34:55 INFO - 2015-11-20 08:34:55,362 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/tmpeTfuE7/profile http://localhost:49536/getInfo.html 08:34:57 INFO - 2015-11-20 08:34:57,914 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 08:34:57 INFO - 2015-11-20 08:34:57,914 DEBUG : BROWSER_OUTPUT: colorDepth:24 08:34:57 INFO - 2015-11-20 08:34:57,914 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 08:34:57 INFO - 2015-11-20 08:34:57,914 DEBUG : BROWSER_OUTPUT: __metrics 08:34:58 INFO - 2015-11-20 08:34:58,651 INFO : Browser initialized. 08:34:58 INFO - 2015-11-20 08:34:58,651 INFO : Running cycle 1/1 for v8_7 test... 08:34:58 INFO - 2015-11-20 08:34:58,652 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/tmpeTfuE7/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 08:35:10 INFO - 2015-11-20 08:35:10,635 DEBUG : BROWSER_OUTPUT: RSS: Main: 236785664 08:35:10 INFO - 2015-11-20 08:35:10,635 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,091 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:49536/tests/v8_7/run.html (next: http://localhost:49536/tests/v8_7/run.html) 08:35:32 INFO - 2015-11-20 08:35:32,348 DEBUG : BROWSER_OUTPUT: RSS: Main: 247574528 08:35:32 INFO - 2015-11-20 08:35:32,348 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,348 DEBUG : BROWSER_OUTPUT: __start_tp_report 08:35:32 INFO - 2015-11-20 08:35:32,348 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 08:35:32 INFO - 2015-11-20 08:35:32,348 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: |0;Richards;147.84151389710232 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;160.05121638924456 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: |2;Encrypt;287.0264064293915 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: |3;Decrypt;4854.368932038835 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: |4;RayTrace;952.3809523809524 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: |5;Earley;717.8750897343862 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: |6;Boyer;12562.5 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: |7;RegExp;28444.444444444445 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: |8;Splay;643.0868167202573 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4522.522522522522 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: __end_tp_report 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: __startTimestamp1448037332341__endTimestamp 08:35:32 INFO - 2015-11-20 08:35:32,349 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: Number of tests: 10 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:147.84 Median:147.84 stddev:0.00 (0.0%) 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: Values: 147.8 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:160.05 Median:160.05 stddev:0.00 (0.0%) 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: Values: 160.1 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:287.03 Median:287.03 stddev:0.00 (0.0%) 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: Values: 287.0 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:4854.37 Median:4854.37 stddev:0.00 (0.0%) 08:35:32 INFO - 2015-11-20 08:35:32,350 DEBUG : BROWSER_OUTPUT: Values: 4854.4 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:952.38 Median:952.38 stddev:0.00 (0.0%) 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: Values: 952.4 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:717.88 Median:717.88 stddev:0.00 (0.0%) 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: Values: 717.9 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12562.50 Median:12562.50 stddev:0.00 (0.0%) 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: Values: 12562.5 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:28444.44 Median:28444.44 stddev:0.00 (0.0%) 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: Values: 28444.4 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:643.09 Median:643.09 stddev:0.00 (0.0%) 08:35:32 INFO - 2015-11-20 08:35:32,351 DEBUG : BROWSER_OUTPUT: Values: 643.1 08:35:32 INFO - 2015-11-20 08:35:32,352 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,352 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4522.52 Median:4522.52 stddev:0.00 (0.0%) 08:35:32 INFO - 2015-11-20 08:35:32,352 DEBUG : BROWSER_OUTPUT: Values: 4522.5 08:35:32 INFO - 2015-11-20 08:35:32,352 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 08:35:32 INFO - 2015-11-20 08:35:32,352 DEBUG : BROWSER_OUTPUT: 08:35:32 INFO - 2015-11-20 08:35:32,971 INFO : Browser exited with error code: 0 08:35:32 INFO - 2015-11-20 08:35:32,989 INFO : Completed test v8_7 (00:00:37) 08:35:33 INFO - 2015-11-20 08:35:33,402 INFO : Completed test suite (00:20:04) 08:35:33 INFO - 2015-11-20 08:35:33,403 DEBUG : Working with test: dromaeo_css 08:35:33 INFO - 2015-11-20 08:35:33,403 DEBUG : Generating results file: dromaeo_css 08:35:33 INFO - 2015-11-20 08:35:33,404 DEBUG : Working with test: kraken 08:35:33 INFO - 2015-11-20 08:35:33,404 DEBUG : Generating results file: kraken 08:35:33 INFO - 2015-11-20 08:35:33,404 INFO : javascript benchmark 08:35:33 INFO - 2015-11-20 08:35:33,404 DEBUG : Working with test: v8_7 08:35:33 INFO - 2015-11-20 08:35:33,404 DEBUG : Generating results file: v8_7 08:35:33 INFO - 2015-11-20 08:35:33,404 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 08:35:33 INFO - 2015-11-20 08:35:33,882 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,61]] 08:35:33 INFO - 2015-11-20 08:35:33,882 DEBUG : process_Request line: dromaeo_css 7755.96 graph.html#tests=[[72,64,61]] 08:35:33 INFO - 2015-11-20 08:35:33,882 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 08:35:33 INFO - 2015-11-20 08:35:33,913 DEBUG : process_Request line: kraken 1517.50 graph.html#tests=[[232,64,61]] 08:35:33 INFO - 2015-11-20 08:35:33,913 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 08:35:33 INFO - 2015-11-20 08:35:33,945 DEBUG : process_Request line: v8_7 22010.67 graph.html#tests=[[230,64,61]] 08:35:33 INFO - 2015-11-20 08:35:33,946 INFO : javascript benchmark 08:35:34 INFO - 2015-11-20 08:35:33,948 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3093.814371137732, 3215.4694475411557, 3499.42259527178, 3586.982065089674, 3595.406757884949, 6046.606970546912, 6047.455728984396, 6069.089636554519, 6098.664573448458, 6134.2332208473945, 4681.4616319123315, 5805.738741756621, 5969.253843269591, 6027.367126451714, 6122.877542449149, 4704.576588107069, 5351.518363347308, 5410.864728381783, 5456.508914197721, 5475.5072043516075, 199.42563559666345, 4767.547083027124, 5209.166533354664, 5521.917171242414, 5598.944010559883, 5014.899702005958, 5399.946000539983, 5415.296011518517, 5429.647072940246, 5488.17677348399, 5444.6188766786345, 5448.155535891943, 5460.453954604547, 5469.945300546983, 5503.6147469677135, 4452.443444569429, 5208.244804503363, 5217.087009773312, 5350.438203988564, 5448.536874365684, 4723.315119307716, 5749.7700091996685, 5890.941090589082, 5904.261967254093, 5920.259967504062, 6251.249850017982, 6413.422791948747, 6418.5507014509, 6431.774887878949, 6438.549301548894, 6236.563440559163, 6305.779297724557, 6395.968020159916, 6420.935790642127, 6494.318096599836, 6136.140940268366, 6140.048292514667, 6145.877082458326, 6150.938490615126, 6162.661053642048, 6590.472762179014, 6641.435477984329, 6670.199576050905, 6685.264620891698, 6694.464442844561, 6123.984276525971, 6179.536534759911, 6249.500039996789, 6282.528810339243, 6300.779472718433, 5849.3858144894175, 6281.057841323838, 6289.339619339903, 6301.96849015752, 6418.8716225675225, 6131.193168498027, 6174.6912654368, 6187.969060154761, 6199.659018754011, 6227.595206311576, 6170.382961703794, 6251.6561589112125, 6268.153799237045, 6293.559450838489, 6299.6535190564955, 5118.897622047538, 5140.46025167352, 5150.948490515122, 5161.4322424533275, 5164.147915593885, 4464.129494748493, 4606.953930460652, 4634.21218392874, 4670.556297151765, 4676.719396836201, 6017.357955396622, 6082.148499210114, 6190.721417536221, 6201.348858369896, 6211.0, 6461.903071453932, 6463.806085817433, 6480.222373315138, 6483.124778154889, 6487.578307410004, 5956.434138756811, 6032.095185722177, 6144.109104179869, 6161.876762464725, 6166.383361663888, 5590.608657394025, 5617.38208797032, 5620.437956204347, 5634.971825140848, 5673.716314184274, 6632.071509988606, 6653.234877988996, 6660.500462465237, 6669.833254168685, 6674.365935236145, 5405.405405405324, 6280.995040793451, 6288.371162883675, 6299.748010079546, 6300.306966233619, 6459.128017717736, 6536.738530458919, 6575.704093315717, 6583.078369028436, 6609.339066093352, 6388.64862432552, 6431.871362572816, 6440.935590644033, 6446.0, 6452.645104519296, 5386.326709161355, 6229.096780966644, 6298.1812364392335, 6470.450011749054, 6534.379233972765, 6279.246490421178, 6294.276158241861, 6294.716737746904, 6299.748010079546, 6311.116443697794, 6268.592541484789, 6290.2766181889665, 6293.685315734287, 6316.715747791269, 6331.9366806331345, 5345.1982202669915, 5590.245316882331, 6071.605345652519, 6149.938500614937, 6256.593321434092, 4949.727764972961, 5122.948770512247, 5148.871278218075, 6166.969165154145, 6203.906941395792, 6004.609700369462, 6038.5772995889865, 6044.486218671462, 6045.546584006305, 6061.181740464981], "unit": "ms", "name": "dojo.html", "value": 5793.28500912058}, {"lowerIsBetter": false, "replicates": [543.5352773378759, 551.8620344913771, 584.7310237290847, 584.8303991842365, 598.189453290791, 41839.79080104599, 42682.14635707284, 42764.0, 42789.0, 42798.0, 46252.0, 46277.0, 46524.53475465244, 46800.765996170056, 46934.76532617341, 9795.167410770093, 9877.802443951117, 9981.201503879673, 10006.049425304584, 10012.349197302152, 9772.778402699663, 9844.803103937917, 9858.16205622523, 9881.110700036996, 9895.356801807859, 9833.606655733762, 9880.25898057645, 9913.256505762061, 9917.305788594802, 9940.5526751296, 9840.3603765755, 9900.851487227697, 9909.009099090106, 9917.504124793732, 9930.106290433896, 9718.70843874685, 9817.558209880572, 9844.95077524615, 9853.655122070764, 9864.161546268575, 42343.57656423458, 42390.57609423897, 42798.71603851889, 42901.4984475545, 43094.353584696255, 2808.255812209766, 3194.0577529628818, 3402.4045791986305, 3647.215848592539, 4134.772587507686, 24757.5048499029, 28883.711162888314, 29828.955986540583, 29838.85080574605, 30062.947796827226, 2716.8369897806197, 2803.733645303693, 2862.041216192578, 2878.136559032303, 2932.7067293270716, 369758.6048279046, 392616.0, 398500.9999999971, 440632.0, 442234.9999999968, 70281.94577081347, 70613.94079088818, 70802.64598677076, 71068.57862842715, 71231.0, 73387.63306183435, 74133.5173296531, 74406.0, 74626.25373746193, 74775.87836182462, 17017.82982170187, 17258.309667613405, 17398.56503587395, 17520.824791752173, 17570.0, 13045.34773261333, 13076.0, 13105.672358191121, 13158.473661053642, 13226.933865330804, 21590.352289431343, 22226.777527236158, 22284.44288892758, 22378.0, 22468.98889549974, 8270.669173233124, 8464.32285417165, 8486.533240671699, 8492.193241642035, 8510.36172287081, 937.9822892161944, 938.1650331205233, 1036.3471013261747, 1101.3612104979093, 1163.5352808319542, 31002.0, 31142.688573114432, 31504.842475787475, 31540.842295788832, 31834.681653183634, 1057.2123767793043, 1063.2822844579878, 1073.8281874900135, 1080.3193987787643, 1092.2136062035322, 14757.557273281818, 14871.405143794127, 15101.169435681142, 15185.696286074437, 15238.0, 559823.0, 561175.0, 561484.0, 565809.0, 566974.9907502781, 60845.695771520855, 60971.6951415249, 61655.691721542, 61699.6915015431, 61839.0, 1419.1910610951659, 1432.906861054049, 1434.3258668425824, 1440.0, 1585.8334874838206, 29502.55746163766, 30083.548746769255, 31346.21634459157, 31350.843245783624, 31760.523592146597, 55916.16125758035, 56144.0, 56261.0, 56539.86920261654, 56861.0, 407714.0, 411283.0, 411948.0, 413914.0, 414495.0, 32494.675053249164, 33073.50389744108, 33204.67181312721, 33301.83349083239, 33380.833095834365, 46592.53407465882, 46906.76546617245, 46963.765181173876, 47154.0, 48520.0, 39262.21475570415, 39453.92085421572, 39532.40701389539, 39594.80202598969, 40529.59470405258, 38080.04799880025, 38480.80759596184, 38650.0, 39167.0, 39381.2123757529, 36937.0, 37024.70413535513, 37252.441213382364, 37711.81144094262, 38878.02804929899, 32605.0, 33476.1630959228, 33579.0, 34099.7852469652, 34534.827325864215, 20943.476413089793, 22529.77470225277, 25225.495490090463, 26060.087896923516, 28637.570436443886], "unit": "ms", "name": "ext.html", "value": 20500.324595884627}, {"lowerIsBetter": false, "replicates": [311.5575882247208, 345.24047096387943, 360.21293473759823, 361.73954752578135, 362.61381628565573, 17028.574285642866, 20071.598568028632, 21195.364139075853, 21412.678809817844, 22583.870806459654, 21162.788372116273, 21407.14371425141, 21729.78270217297, 21771.0, 21816.563668726616, 5694.886102277952, 5713.542916566665, 5827.825165245049, 5833.795817146401, 5843.766249350021, 5791.189233507313, 5805.419458054182, 5828.184054232411, 5833.270841144857, 5836.328822185439, 5643.463870932255, 5713.17159011943, 5728.79949201778, 5733.340665823421, 5773.56698247631, 5607.915881261784, 5622.5100348407705, 5648.943510564883, 5649.209110724501, 5654.349749778787, 4902.313676085351, 4911.435184953704, 4914.877128071791, 5277.70972596507, 5460.208269800896, 12989.025823063308, 13208.0, 13268.336583170803, 23917.521649567087, 26417.886569074428, 2120.236714782677, 2176.4341271269427, 2224.7663995280423, 2230.3309007297908, 2260.276711452336, 9614.807703845883, 9903.405795652212, 13190.60428187156, 14526.910481713914, 15799.289031993589, 1773.485689150145, 1779.9822001780076, 1838.154448953483, 1943.7375954246138, 2111.4721319670084, 109102.0, 113446.43276783646, 116273.0, 116982.41508792486, 118375.99999999914, 20528.794712052986, 20628.69056964147, 20636.174553018012, 20810.063547140417, 20992.685109723367, 13068.738625227632, 13248.20510769357, 13283.66790830237, 13383.263920484273, 24946.501069978498, 8521.062683104978, 8642.351823613255, 8656.004559475741, 8710.912890871137, 8724.95637521821, 8824.735257942271, 8882.333824963154, 8915.866262006075, 8940.32947528938, 9003.819923601492, 3291.7037466628117, 3842.8471458562876, 3989.5611482737454, 4438.423005009328, 4460.910781784346, 1560.859522642945, 1824.6533158699804, 1836.696945004086, 1887.6790945539017, 1894.1097684088456, 352.7654110016861, 417.9331306990867, 769.288408222392, 935.6023689931752, 1038.2887721910515, 11390.316581005167, 11703.76592468163, 11786.445388573275, 11849.466773995191, 11870.34713090771, 435.0906605195157, 436.26053838743024, 437.16719649068574, 441.492283873548, 445.2786485892874, 6113.633182009094, 6169.784057557964, 11491.712707182387, 12068.09489288307, 12102.33437160947, 761726.0, 767923.0, 775532.3670144952, 780521.0, 782179.0891045622, 128907.0, 131915.0, 132940.00589991157, 133654.99999999805, 135006.0, 1199.6640940536663, 1210.5218438716834, 1217.6955761059735, 1223.9265644061384, 1229.0, 18372.265109395474, 19708.901455492633, 20012.799232046124, 20162.0, 20234.79765202329, 44871.55128448674, 53305.0, 53898.730506347216, 54743.0, 55979.44020559742, 69865.0, 69931.30068699247, 70289.29710702828, 71822.0, 73101.26898731157, 9786.706398807763, 9850.261230407605, 10042.297039207186, 10064.194864410976, 10081.395116293046, 20010.59978800445, 20323.08546115458, 20655.967201639556, 20743.58512829765, 20985.790142098384, 15814.841851581337, 15976.840231598, 16070.196490175678, 16346.591335216715, 16407.343706251617, 15798.0, 16004.839951600336, 16055.0, 16229.918850405673, 16274.640177174007, 16373.672526549164, 16822.327106916076, 16885.831141688424, 17015.0, 17169.48491545256, 9658.90341096608, 9697.175740062174, 9956.601735930482, 9984.450855203033, 10008.899911000797, 10284.331518451278, 12311.322877241479, 16120.193990300673, 16311.0, 16455.25951332169], "unit": "ms", "name": "jquery.html", "value": 9887.74684593879}, {"lowerIsBetter": false, "replicates": [1523.6419441431262, 1562.1330161760225, 1886.8018858019916, 1906.9702360725205, 1939.2533874458334, 7824.217578242187, 7863.252990965863, 8244.422890397675, 8336.874946875794, 8351.540665263408, 8119.756407307776, 8244.628991695374, 8343.582820858948, 8355.91644083559, 8362.665493380273, 2346.648002799581, 2408.0608562660577, 2414.8551086934754, 2416.7583241675866, 2424.987875060622, 2400.9759902401015, 2445.7921076708503, 2460.225029115823, 2462.91379801707, 2470.5800013997664, 2384.3681424422457, 2388.164142550111, 2414.782669559739, 2419.661247425362, 2429.2226487524, 2373.774491423312, 2397.928062158138, 2416.492536567323, 2426.551088048717, 2427.9514409711796, 2408.89159987801, 2419.600765873629, 2443.1693224303644, 2445.254197469771, 2455.0057226823164, 8386.748397548023, 8475.533845638487, 8487.321014318839, 8498.872516912252, 8499.405041647087, 4780.211265141247, 5227.294315267466, 5296.708681022542, 5306.124489459235, 5310.389305229871, 3268.346330733863, 3492.1095120744303, 3520.8591656333715, 3582.42681171014, 3619.60184379718, 1007.808516381885, 1043.2853495355705, 1071.5553045486115, 1093.6828319787332, 1095.1840878545454, 10947.0, 10978.835317470244, 10981.725456863562, 10984.956429139298, 11021.228514004022, 4314.0, 4806.591439727662, 4821.083994041121, 4871.415430148405, 4912.459629440758, 9618.567164477616, 9639.855402168972, 9702.5148742564, 9718.319717619841, 9795.461249631197, 5254.185601231815, 5286.97356513215, 5292.391374991926, 5296.364436267596, 5321.574274058066, 4831.782569784368, 4840.588549973221, 4868.440129385095, 4872.049950259736, 4885.462599114095, 3900.6684431823046, 3903.941440878389, 3925.862594809168, 3925.8822235332987, 3933.350997085449, 1280.551806867589, 1287.9034072444604, 1288.6778305423645, 1290.071148772882, 1291.2704322058007, 1328.6657649773197, 1343.395472037587, 1358.877701006914, 1393.909395889264, 1406.423366419763, 7686.231376862269, 7712.383009359238, 7723.806904827425, 7745.031871016123, 7779.688812447439, 420.4492115328929, 494.61667207914155, 508.0474111041797, 513.7790749977546, 513.9595804655512, 5904.734286957011, 6070.2412198475195, 6071.089336599457, 6086.939130608637, 6112.724927378279, 9515.57179926905, 10074.194064474825, 10315.1747860171, 10322.948385258025, 10375.688729338131, 9746.951265243628, 10132.544035518273, 10146.391216526885, 10149.289549731448, 10243.692689219335, 7956.562389068541, 7988.720394786154, 8003.719869804529, 8017.719379821795, 8096.068952070469, 7822.256885595859, 7823.608819558885, 7877.684892604231, 7918.564478953713, 7928.960355198187, 9097.49963752, 9268.304877134107, 9272.350935434455, 9275.07249275067, 9286.0, 9261.953690231776, 9437.669681561387, 9446.24430045581, 9498.905010949802, 9513.668086468038, 7328.120625524971, 7359.227281135403, 7444.143923448873, 7462.664180112017, 7466.887996680162, 8025.438219324591, 8060.39547033963, 8108.027036755627, 8114.148014458633, 8114.675412983414, 7371.705131794668, 7485.7754267372065, 7487.138979017265, 7582.052243469567, 7613.314801667876, 7340.559566425818, 7413.481056326221, 7423.109226892808, 7438.144613369315, 7482.663280152297, 7513.173550909286, 7542.245775422414, 7572.545647261182, 7574.81062973408, 7615.162332143571, 6840.144981877265, 6842.623655698984, 6857.348551887562, 6864.141982252218, 6873.862522749617, 6941.583504989717, 6946.409555187865, 6969.686364113526, 6982.162140542964, 7082.822929426806], "unit": "ms", "name": "mootools.html", "value": 4747.029845486002}, {"lowerIsBetter": false, "replicates": [290.30182411300825, 328.1746407784421, 332.27563910674735, 332.506228251047, 335.9395308844407, 6936.410405115565, 6989.930100698992, 7101.928980710191, 7149.571025738459, 7213.675384607692, 6967.512274140812, 6970.16358037035, 7011.964940175292, 7058.082449281586, 7063.223045464994, 4157.52188498322, 4660.883477913062, 4952.900941981158, 5027.773750181251, 5035.370578677665, 5100.234964755279, 5102.668326558781, 5105.472790968476, 5118.4113826909825, 5160.845174644748, 4117.60882716143, 5068.960863023071, 5071.543561079502, 5073.568746656539, 5094.872628184306, 4351.804168812395, 4852.150873597124, 5087.338645976037, 5097.872553186163, 5099.59203263738, 4227.957720422787, 4326.8269269229195, 4342.630876375511, 4345.06581085065, 4349.369341445473, 6609.735610575572, 6632.0, 6647.202335719745, 6659.800205993828, 6676.031975363545, 5944.554158438134, 5949.167116603679, 5951.256092988377, 5961.463468287831, 5966.552508561876, 7189.640517974132, 7388.556686598768, 7398.482106252564, 7418.629068546605, 7429.925700742978, 4478.57453541913, 4866.31871537985, 4867.2212446008825, 4873.707577545323, 4876.756162191876, 7739.535627862347, 7848.13670496245, 7876.52740835546, 7890.605469726548, 7922.960385198037, 4743.857684269477, 4952.504749525018, 4957.975210123926, 4959.454460009396, 4970.950290497121, 5045.772940217699, 5049.6212784041345, 5055.317532133188, 5059.56993655536, 5061.848144555595, 5960.791372301948, 5974.820755377345, 5980.581359304807, 5990.580659353804, 6003.729832157564, 7270.781876543712, 7451.844964030584, 7461.552306861606, 7462.514936529108, 7463.738769143054, 1749.2740512687346, 1776.2273411066228, 1776.422662634649, 1776.644671065792, 1780.6972814621545, 1038.5949479702922, 1137.8236373362142, 1141.1498433666804, 1147.942602869853, 1157.7915975124558, 6300.527460440485, 6647.235567909753, 7115.217326094125, 7129.607871567114, 7225.132984041844, 7830.3735701144915, 7904.051513818378, 7917.406194535433, 7926.524408535506, 7956.761297161094, 6229.221347331583, 7190.96404517974, 7197.208307086216, 7206.711731530785, 7213.49505534618, 4003.579624139482, 4148.79256037197, 4152.522459917148, 4157.812898419578, 4169.520505141887, 7074.964625176841, 7212.891806622905, 8076.959615201887, 8112.472689275178, 8191.467554608931, 7822.765317040498, 8081.838363232702, 8091.514509129471, 8095.797605059921, 8111.148329425326, 6783.423409010289, 7089.751858684921, 8068.7175948841505, 8097.473664211808, 8120.269175774209, 7811.375089992901, 7814.570198638902, 7848.803779905548, 7855.921440785748, 7870.5671188082915, 6725.596464212163, 6901.033855260167, 7066.152061752623, 7691.923080769121, 7754.612269386621, 7523.210062943313, 8162.265396114378, 8192.139825318494, 8195.549244791593, 8214.26071653554, 4745.264484004984, 4784.40194975628, 4785.330053792402, 4785.330053792402, 4787.61699064081, 7601.885971710318, 7789.415793815373, 7800.921990780246, 7817.804554886174, 7856.45004849655, 7478.252174782696, 7491.138519070377, 7500.362469189961, 7530.510516816389, 7539.132999705104, 7306.59813710251, 7514.62426878643, 7519.511231769918, 7519.962400187964, 7537.2462753724185, 6772.830679233059, 7159.749408770668, 7281.344678978918, 7313.67088481009, 7317.451191160791, 6095.085737139465, 6233.883058470765, 7187.41876787106, 7430.702771889064, 7471.850562988601, 6455.580387274812, 7337.853242935218, 7370.742024029133, 7374.1151061872915, 7389.519681220703], "unit": "ms", "name": "prototype.html", "value": 5409.392678689466}, {"lowerIsBetter": false, "replicates": [684.777447329618, 760.6919197724922, 801.9639116239769, 823.098706915927, 851.9691173679847, 15029.173395463245, 15171.92414037931, 15397.6150596235, 15405.075695458267, 15456.304466299016, 13994.370253338599, 14618.634534136652, 14659.63350916225, 14661.853381466182, 14679.706405871877, 931.2643012020529, 940.0458534587399, 943.575391074016, 958.7075941837737, 960.0831206198064, 952.033685808901, 960.2174228004154, 960.4045491795061, 964.4936408385619, 968.4818622037211, 993.2600212841443, 1002.7493126718321, 1006.0342071611262, 1007.7732510185223, 1012.6607586458546, 992.2508506077937, 996.3971797062782, 1001.4792307999872, 1007.4811472091878, 1007.50632190227, 739.2865884421559, 753.1865585168006, 753.6834529497625, 754.4982586579918, 756.1984296645574, 15394.923025384913, 15434.305456254495, 15538.223088845625, 15551.0, 15568.131824181171, 10973.177011724072, 12489.18820276679, 12492.00127979528, 12551.246925184427, 12566.81149782754, 10126.240531960133, 10248.282620216587, 10311.226658000605, 10322.593534144811, 10337.586496540129, 3491.476278558211, 3510.6313837047255, 3533.0460775590705, 3537.6462353764673, 3542.397792375277, 84572.0, 85067.99999999937, 85695.0, 85919.0, 86019.56990215072, 9579.952100239454, 9623.855642165374, 9635.98822123681, 9727.13303197126, 9871.75320616976, 21664.891675541836, 21715.78284217169, 21795.782042179377, 21826.236081737065, 21846.45383865416, 7331.633418329062, 7439.032925719622, 7625.275598818103, 7642.579658118857, 7764.262395072459, 4125.278076336629, 4224.746515209097, 4227.175700738388, 4250.893727656833, 4360.41134446852, 3600.873969411058, 3604.5494313210847, 3606.3328284267495, 3616.132128289244, 3635.2729454109285, 589.104561067184, 602.524006035236, 611.0986295214523, 633.0504243634548, 668.5854770042605, 589.0839744197814, 607.9240094988127, 612.8023042161249, 632.6109442692803, 633.0, 8523.829523409497, 8751.124887511198, 8814.77963050916, 8914.955425222832, 9483.47840868745, 511.97440127994196, 554.4040156831422, 562.2774734466192, 582.5630776917312, 598.1595857819771, 4440.955590444119, 4447.933281000787, 4534.206513860061, 4549.249373853343, 4603.217453032992, 96179.0, 96288.55567166499, 97003.0, 99806.0, 106322.0, 81339.59330203429, 82514.0, 82844.58577707072, 84492.57753711192, 87750.0, 77668.0, 78184.60907695425, 78297.0, 78383.60808196037, 80031.19968800354, 8973.82052358936, 8999.370044097112, 9043.457392556467, 9190.356675032683, 9302.627894884128, 51824.704382390744, 52086.73956630193, 52657.0, 52894.20658690199, 53090.46909530855, 79558.0, 79885.60057199677, 79924.60037699774, 80037.0, 80552.0, 10836.187285953743, 11016.724581885517, 11026.614068507884, 11376.772464550828, 11932.582359617372, 12264.632061038183, 12311.630651080482, 12549.623511294676, 12557.74884502323, 12740.0, 11689.766204676029, 11727.061835053004, 11765.941170294094, 11810.468528916392, 11893.643190704293, 11813.645590632295, 11817.290962542274, 11823.0, 11941.343226122646, 11954.521819127138, 11428.542858285575, 11576.652700419001, 11664.066874650178, 11736.0611151106, 11774.3524106175, 9789.755256118655, 10010.799784004425, 10237.74405639865, 10257.076863082359, 10384.896151038694, 8174.386920981069, 8767.29861611057, 9861.654842080492, 9899.257555683209, 9900.405975641484], "unit": "ms", "name": "yui.html", "value": 7218.098327937565}], "name": "dromaeo_css", "value": 7755.956745618924}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [115.0, 116.0, 167.0, 164.0, 147.0, 183.0, 153.0, 115.0, 115.0, 116.0], "unit": "ms", "name": "ai-astar", "value": 139.1}, {"lowerIsBetter": true, "replicates": [146.0, 123.0, 144.0, 157.0, 120.0, 143.0, 141.0, 119.0, 160.0, 146.0], "unit": "ms", "name": "audio-beat-detection", "value": 139.9}, {"lowerIsBetter": true, "replicates": [192.0, 188.0, 197.0, 200.0, 223.0, 198.0, 198.0, 196.0, 201.0, 195.0], "unit": "ms", "name": "audio-dft", "value": 198.8}, {"lowerIsBetter": true, "replicates": [59.0, 80.0, 72.0, 106.0, 57.0, 55.0, 58.0, 60.0, 118.0, 78.0], "unit": "ms", "name": "audio-fft", "value": 74.3}, {"lowerIsBetter": true, "replicates": [77.0, 76.0, 108.0, 75.0, 76.0, 77.0, 93.0, 105.0, 111.0, 147.0], "unit": "ms", "name": "audio-oscillator", "value": 94.5}, {"lowerIsBetter": true, "replicates": [108.0, 133.0, 86.0, 87.0, 89.0, 88.0, 87.0, 88.0, 88.0, 91.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 94.5}, {"lowerIsBetter": true, "replicates": [98.0, 149.0, 95.0, 97.0, 95.0, 96.0, 102.0, 95.0, 92.0, 96.0], "unit": "ms", "name": "imaging-darkroom", "value": 101.5}, {"lowerIsBetter": true, "replicates": [91.0, 90.0, 132.0, 145.0, 147.0, 91.0, 94.0, 100.0, 137.0, 147.0], "unit": "ms", "name": "imaging-desaturate", "value": 117.4}, {"lowerIsBetter": true, "replicates": [60.0, 60.0, 60.0, 60.0, 58.0, 58.0, 58.0, 67.0, 60.0, 58.0], "unit": "ms", "name": "json-parse-financial", "value": 59.9}, {"lowerIsBetter": true, "replicates": [66.0, 66.0, 66.0, 66.0, 67.0, 68.0, 68.0, 69.0, 68.0, 72.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 67.6}, {"lowerIsBetter": true, "replicates": [78.0, 94.0, 108.0, 96.0, 84.0, 82.0, 86.0, 84.0, 86.0, 83.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 88.1}, {"lowerIsBetter": true, "replicates": [122.0, 155.0, 129.0, 120.0, 121.0, 125.0, 129.0, 121.0, 109.0, 134.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 126.5}, {"lowerIsBetter": true, "replicates": [145.0, 139.0, 143.0, 139.0, 140.0, 125.0, 168.0, 172.0, 179.0, 140.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 149.0}, {"lowerIsBetter": true, "replicates": [66.0, 66.0, 66.0, 67.0, 68.0, 67.0, 66.0, 66.0, 67.0, 65.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 66.4}], "name": "kraken", "value": 1517.5}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [147.84151389710232], "unit": "score", "name": "Richards", "value": 238.78272800000002}, {"lowerIsBetter": false, "replicates": [160.05121638924456], "unit": "score", "name": "DeltaBlue", "value": 413.1052640000001}, {"lowerIsBetter": false, "replicates": [287.0264064293915], "unit": "score", "name": "Encrypt", "value": 927.3746040000002}, {"lowerIsBetter": false, "replicates": [4854.368932038835], "unit": "score", "name": "Decrypt", "value": 54.83328600000002}, {"lowerIsBetter": false, "replicates": [952.3809523809524], "unit": "score", "name": "RayTrace", "value": 776.9884500000003}, {"lowerIsBetter": false, "replicates": [717.8750897343862], "unit": "score", "name": "Earley", "value": 928.3829590000004}, {"lowerIsBetter": false, "replicates": [12562.5], "unit": "score", "name": "Boyer", "value": 53.05178109452737}, {"lowerIsBetter": false, "replicates": [28444.444444444445], "unit": "score", "name": "RegExp", "value": 32.02681640624999}, {"lowerIsBetter": false, "replicates": [643.0868167202573], "unit": "score", "name": "Splay", "value": 126.71850499999996}, {"lowerIsBetter": false, "replicates": [4522.522522522522], "unit": "score", "name": "NavierStokes", "value": 328.13545816733085}], "name": "v8_7", "value": 22010.665592221856}]} 08:35:34 INFO - RETURN: dromaeo_css: 7755.96 08:35:34 INFO - RETURN: kraken: 1517.50 08:35:34 INFO - RETURN: v8_7: 22010.67 08:35:34 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,61]]", "result": "22010.67"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,61]]", "result": "1517.50"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,61]]", "result": "7755.96"}}} 08:35:34 INFO - Return code: 0 08:35:34 INFO - # TBPL SUCCESS # 08:35:34 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 08:35:34 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 08:35:34 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 08:35:34 INFO - 2015-11-20 08:35:34.057 screenresolution[1997:17610] starting screenresolution argv=screenresolution get 08:35:34 INFO - 2015-11-20 08:35:34.060 screenresolution[1997:17610] Display 0: 1600x1200x32@60 08:35:34 INFO - 2015-11-20 08:35:34.066 screenresolution[1998:17613] starting screenresolution argv=screenresolution list 08:35:34 INFO - Available Modes on Display 0 08:35:34 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 08:35:34 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 08:35:34 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 08:35:34 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 08:35:34 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 08:35:34 INFO - Intel Iris: 08:35:34 INFO - Chipset Model: Intel Iris 08:35:34 INFO - Type: GPU 08:35:34 INFO - Bus: Built-In 08:35:34 INFO - VRAM (Dynamic, Max): 1536 MB 08:35:34 INFO - Vendor: Intel (0x8086) 08:35:34 INFO - Device ID: 0x0a2e 08:35:34 INFO - Revision ID: 0x0009 08:35:34 INFO - Displays: 08:35:34 INFO - Display: 08:35:34 INFO - Resolution: 1600 x 1200 @ 60 Hz 08:35:34 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 08:35:34 INFO - Display Serial Number: 1600x1200 60 08:35:34 INFO - Main Display: Yes 08:35:34 INFO - Mirror: Off 08:35:34 INFO - Online: Yes 08:35:34 INFO - Rotation: Supported 08:35:34 INFO - Return code: 0 08:35:34 INFO - Running post-action listener: _resource_record_post_action 08:35:34 INFO - Running post-run listener: _resource_record_post_run 08:35:35 INFO - Total resource usage - Wall time: 1236s; CPU: 53.0%; Read bytes: 1265664; Write bytes: 694831104; Read time: 18; Write time: 2137 08:35:35 INFO - install - Wall time: 31s; CPU: 54.0%; Read bytes: 335262208; Write bytes: 336967168; Read time: 26059; Write time: 640 08:35:35 INFO - run-tests - Wall time: 1206s; CPU: 53.0%; Read bytes: 1265664; Write bytes: 347496960; Read time: 18; Write time: 1464 08:35:35 INFO - Running post-run listener: _upload_blobber_files 08:35:35 INFO - Blob upload gear active. 08:35:35 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 08:35:35 INFO - Copying logs to upload dir... 08:35:35 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1278.128681 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 18 secs) (at 2015-11-20 08:35:35.436423) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-20 08:35:35.440270) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.j5gZlaa0CW/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test/properties RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.poedk48og4/Listeners TMPDIR=/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False build_url:https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.009483 build_url: 'https://queue.taskcluster.net/v1/task/QDlriozVTauSAMWJX4icSw/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 0.02 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-20 08:35:35.467667) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 08:35:35.468427) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.j5gZlaa0CW/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.poedk48og4/Listeners TMPDIR=/var/folders/yb/6_0vgb8j0qs3lyb34nncdvy400000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.004607 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-20 08:35:35.521266) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-20 08:35:35.521949) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-20 08:35:35.522733) ========= ========= Total master_lag: 22.60 =========