builder: fx-team_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0066 starttime: 1454871413.66 results: success (0) buildid: 20160207090759 builduid: d4689b7cc2a84fd5a40ef1d773bb9785 revision: baf5ffa90789d6f27154f6dee50111eebceaeb26 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:53.663495) ========= master: http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:53.664246) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:53.664582) ========= 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.ag6rmJaZu4/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.UDujEqUfXo/Listeners TMPDIR=/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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.005711 basedir: '/builds/slave/test' ========= master_lag: 0.07 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:53.740743) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:53.741093) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:53.947909) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:53.948206) ========= 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.ag6rmJaZu4/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.UDujEqUfXo/Listeners TMPDIR=/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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.005654 ========= master_lag: 0.08 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:54.030871) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:54.031511) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:54.031900) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:54.032208) ========= 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.ag6rmJaZu4/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.UDujEqUfXo/Listeners TMPDIR=/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 --2016-02-07 10:56:54-- 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% 49.1M=0s 2016-02-07 10:56:54 (49.1 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.564174 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:54.625421) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:54.625798) ========= 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.ag6rmJaZu4/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.UDujEqUfXo/Listeners TMPDIR=/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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.027550 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:54.675834) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-02-07 10:56:54.676226) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev baf5ffa90789d6f27154f6dee50111eebceaeb26 --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 baf5ffa90789d6f27154f6dee50111eebceaeb26 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ag6rmJaZu4/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.UDujEqUfXo/Listeners TMPDIR=/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 2016-02-07 10:56:54,745 truncating revision to first 12 chars 2016-02-07 10:56:54,746 Setting DEBUG logging. 2016-02-07 10:56:54,746 attempt 1/10 2016-02-07 10:56:54,746 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/baf5ffa90789?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-07 10:56:55,844 unpacking tar archive at: fx-team-baf5ffa90789/testing/mozharness/ program finished with exit code 0 elapsedTime=1.345615 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-02-07 10:56:56.042014) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:56.042387) ========= echo baf5ffa90789d6f27154f6dee50111eebceaeb26 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'baf5ffa90789d6f27154f6dee50111eebceaeb26'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ag6rmJaZu4/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.UDujEqUfXo/Listeners TMPDIR=/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 baf5ffa90789d6f27154f6dee50111eebceaeb26 program finished with exit code 0 elapsedTime=0.005420 script_repo_revision: 'baf5ffa90789d6f27154f6dee50111eebceaeb26' ========= master_lag: 0.07 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:56.120280) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:56.123644) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-07 10:56:56.157429) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 22 secs) (at 2016-02-07 10:56:56.157727) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --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', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--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.ag6rmJaZu4/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.UDujEqUfXo/Listeners TMPDIR=/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 10:56:56 INFO - MultiFileLogger online at 20160207 10:56:56 in /builds/slave/test 10:56:56 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 10:56:56 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:56:56 INFO - {'append_to_log': False, 10:56:56 INFO - 'base_work_dir': '/builds/slave/test', 10:56:56 INFO - 'blob_upload_branch': 'Fx-Team', 10:56:56 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:56:56 INFO - 'branch': 'Fx-Team', 10:56:56 INFO - 'buildbot_json_path': 'buildprops.json', 10:56:56 INFO - 'config_files': ('talos/mac_config.py',), 10:56:56 INFO - 'default_actions': ('clobber', 10:56:56 INFO - 'read-buildbot-config', 10:56:56 INFO - 'download-and-extract', 10:56:56 INFO - 'populate-webroot', 10:56:56 INFO - 'create-virtualenv', 10:56:56 INFO - 'install', 10:56:56 INFO - 'run-tests'), 10:56:56 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:56:56 INFO - 'download_minidump_stackwalk': True, 10:56:56 INFO - 'download_symbols': 'ondemand', 10:56:56 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:56:56 INFO - 'tooltool.py': '/tools/tooltool.py', 10:56:56 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:56:56 INFO - '/tools/misc-python/virtualenv.py')}, 10:56:56 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:56:56 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:56:56 INFO - 'installer_path': 'installer.exe', 10:56:56 INFO - 'log_level': 'info', 10:56:56 INFO - 'log_name': 'talos', 10:56:56 INFO - 'log_to_console': True, 10:56:56 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 10:56:56 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 10:56:56 INFO - 'opt_config_files': (), 10:56:56 INFO - 'pip_index': False, 10:56:56 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 10:56:56 INFO - 'cmd': ('bash', 10:56:56 INFO - '-c', 10:56:56 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 10:56:56 INFO - 'enabled': True, 10:56:56 INFO - 'halt_on_failure': False, 10:56:56 INFO - 'name': 'check_screen_resolution'},), 10:56:56 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 10:56:56 INFO - 'cmd': ('bash', 10:56:56 INFO - '-c', 10:56:56 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 10:56:56 INFO - 'enabled': True, 10:56:56 INFO - 'halt_on_failure': False, 10:56:56 INFO - 'name': 'check_screen_resolution'},), 10:56:56 INFO - 'run_cmd_checks_enabled': True, 10:56:56 INFO - 'sps_profile': False, 10:56:56 INFO - 'sps_profile_interval': 0, 10:56:56 INFO - 'suite': 'dromaeojs', 10:56:56 INFO - 'system_bits': '32', 10:56:56 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:56:56 INFO - 'title': 't-yosemite-r7-0066', 10:56:56 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:56:56 INFO - 'use_talos_json': True, 10:56:56 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:56:56 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:56:56 INFO - 'work_dir': 'build'} 10:56:56 INFO - ##### 10:56:56 INFO - ##### Running clobber step. 10:56:56 INFO - ##### 10:56:56 INFO - Running pre-action listener: _resource_record_pre_action 10:56:56 INFO - Running main action method: clobber 10:56:56 INFO - rmtree: /builds/slave/test/build 10:56:56 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:56:58 INFO - Running post-action listener: _resource_record_post_action 10:56:58 INFO - ##### 10:56:58 INFO - ##### Running read-buildbot-config step. 10:56:58 INFO - ##### 10:56:58 INFO - Running pre-action listener: _resource_record_pre_action 10:56:58 INFO - Running main action method: read_buildbot_config 10:56:58 INFO - Using buildbot properties: 10:56:58 INFO - { 10:56:58 INFO - "project": "", 10:56:58 INFO - "product": "firefox", 10:56:58 INFO - "script_repo_revision": "production", 10:56:58 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs", 10:56:58 INFO - "repository": "", 10:56:58 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs", 10:56:58 INFO - "buildid": "20160207090759", 10:56:58 INFO - "pgo_build": "False", 10:56:58 INFO - "basedir": "/builds/slave/test", 10:56:58 INFO - "buildnumber": 408, 10:56:58 INFO - "slavename": "t-yosemite-r7-0066", 10:56:58 INFO - "master": "http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/", 10:56:58 INFO - "platform": "yosemite_r7", 10:56:58 INFO - "scheduler": "tests-fx-team-macosx64-talos", 10:56:58 INFO - "branch": "fx-team", 10:56:58 INFO - "repo_path": "integration/fx-team", 10:56:58 INFO - "revision": "baf5ffa90789d6f27154f6dee50111eebceaeb26", 10:56:58 INFO - "stage_platform": "macosx64", 10:56:58 INFO - "builduid": "d4689b7cc2a84fd5a40ef1d773bb9785", 10:56:58 INFO - "slavebuilddir": "test" 10:56:58 INFO - } 10:56:58 INFO - Found installer url https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg. 10:56:58 INFO - Running post-action listener: _resource_record_post_action 10:56:58 INFO - ##### 10:56:58 INFO - ##### Running download-and-extract step. 10:56:58 INFO - ##### 10:56:58 INFO - Running pre-action listener: _resource_record_pre_action 10:56:58 INFO - Running main action method: download_and_extract 10:56:58 INFO - mkdir: /builds/slave/test/build/tests 10:56:58 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')]} 10:56:58 INFO - https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 10:56:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/test_packages.json 10:56:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/test_packages.json 10:56:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 10:56:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 10:57:02 INFO - Downloaded 1277 bytes. 10:57:02 INFO - Reading from file /builds/slave/test/build/test_packages.json 10:57:02 INFO - Using the following test package requirements: 10:57:02 INFO - {u'common': [u'firefox-47.0a1.en-US.mac.common.tests.zip'], 10:57:02 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:57:02 INFO - u'firefox-47.0a1.en-US.mac.cppunittest.tests.zip'], 10:57:02 INFO - u'gtest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:57:02 INFO - u'firefox-47.0a1.en-US.mac.gtest.tests.zip'], 10:57:02 INFO - u'jittest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:57:02 INFO - u'jsshell-mac.zip'], 10:57:02 INFO - u'mochitest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:57:02 INFO - u'firefox-47.0a1.en-US.mac.mochitest.tests.zip'], 10:57:02 INFO - u'mozbase': [u'firefox-47.0a1.en-US.mac.common.tests.zip'], 10:57:02 INFO - u'reftest': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:57:02 INFO - u'firefox-47.0a1.en-US.mac.reftest.tests.zip'], 10:57:02 INFO - u'talos': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:57:02 INFO - u'firefox-47.0a1.en-US.mac.talos.tests.zip'], 10:57:02 INFO - u'web-platform': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:57:02 INFO - u'firefox-47.0a1.en-US.mac.web-platform.tests.zip'], 10:57:02 INFO - u'webapprt': [u'firefox-47.0a1.en-US.mac.common.tests.zip'], 10:57:02 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.mac.common.tests.zip', 10:57:02 INFO - u'firefox-47.0a1.en-US.mac.xpcshell.tests.zip']} 10:57:02 INFO - Downloading packages: [u'firefox-47.0a1.en-US.mac.common.tests.zip'] for test suite category: common 10:57:02 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')]} 10:57:02 INFO - https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 10:57:02 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:57:02 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:57:02 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:57:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip'}, attempt #1 10:57:03 INFO - Downloaded 17753590 bytes. 10:57:03 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:57:03 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 10:57:06 INFO - Return code: 0 10:57:06 INFO - Downloading packages: [u'firefox-47.0a1.en-US.mac.common.tests.zip', u'firefox-47.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 10:57:06 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')]} 10:57:06 INFO - https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 10:57:06 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:57:06 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:57:06 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip 10:57:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip'}, attempt #1 10:57:23 INFO - Downloaded 17753590 bytes. 10:57:23 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:57:23 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 10:57:26 INFO - Return code: 0 10:57:26 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')]} 10:57:26 INFO - https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 10:57:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip 10:57:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip 10:57:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.mac.talos.tests.zip 10:57:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.talos.tests.zip'}, attempt #1 10:57:27 INFO - Downloaded 10706547 bytes. 10:57:27 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:57:27 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 10:57:27 INFO - Return code: 0 10:57:27 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')]} 10:57:27 INFO - https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 10:57:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 10:57:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 10:57:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg 10:57:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg'}, attempt #1 10:57:31 INFO - Downloaded 111821860 bytes. 10:57:31 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 10:57:31 INFO - mkdir: /builds/slave/test/properties 10:57:31 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:57:31 INFO - Writing to file /builds/slave/test/properties/build_url 10:57:31 INFO - Contents: 10:57:31 INFO - build_url:https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg 10:57:32 INFO - Running post-action listener: _resource_record_post_action 10:57:32 INFO - Running post-action listener: set_extra_try_arguments 10:57:32 INFO - ##### 10:57:32 INFO - ##### Running populate-webroot step. 10:57:32 INFO - ##### 10:57:32 INFO - Running pre-action listener: _resource_record_pre_action 10:57:32 INFO - Running main action method: populate_webroot 10:57:32 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:57:32 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:57:32 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:57:32 INFO - '--tppagecycles', 10:57:32 INFO - '7'], 10:57:32 INFO - 'tests': ['tsvgm']}}, 10:57:32 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 10:57:32 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 10:57:32 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:57:32 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 10:57:32 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 10:57:32 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:57:32 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:57:32 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:57:32 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:57:32 INFO - 'talos_options': ['--e10s'], 10:57:32 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:57:32 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:57:32 INFO - 'tests': ['damp', 'tps']}, 10:57:32 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:57:32 INFO - 'talos_options': ['--e10s'], 10:57:32 INFO - 'tests': ['damp', 'tps']}, 10:57:32 INFO - 'g3': {'tests': ['dromaeo_dom']}, 10:57:32 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:57:32 INFO - 'other': {'tests': ['a11yr', 10:57:32 INFO - 'ts_paint', 10:57:32 INFO - 'tpaint', 10:57:32 INFO - 'sessionrestore', 10:57:32 INFO - 'sessionrestore_no_auto_restore']}, 10:57:32 INFO - 'other-e10s': {'talos_options': ['--e10s'], 10:57:32 INFO - 'tests': ['a11yr', 10:57:32 INFO - 'ts_paint', 10:57:32 INFO - 'tpaint', 10:57:32 INFO - 'sessionrestore', 10:57:32 INFO - 'sessionrestore_no_auto_restore']}, 10:57:32 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 10:57:32 INFO - 'tests': ['a11yr', 10:57:32 INFO - 'ts_paint', 10:57:32 INFO - 'tpaint', 10:57:32 INFO - 'sessionrestore', 10:57:32 INFO - 'sessionrestore_no_auto_restore']}, 10:57:32 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 10:57:32 INFO - 'tests': ['a11yr', 10:57:32 INFO - 'ts_paint', 10:57:32 INFO - 'tpaint', 10:57:32 INFO - 'sessionrestore', 10:57:32 INFO - 'sessionrestore_no_auto_restore']}, 10:57:32 INFO - 'other_l64': {'tests': ['a11yr', 10:57:32 INFO - 'ts_paint', 10:57:32 INFO - 'tpaint', 10:57:32 INFO - 'sessionrestore', 10:57:32 INFO - 'sessionrestore_no_auto_restore']}, 10:57:32 INFO - 'other_nol64': {'tests': ['a11yr', 10:57:32 INFO - 'ts_paint', 10:57:32 INFO - 'tpaint', 10:57:32 INFO - 'sessionrestore', 10:57:32 INFO - 'sessionrestore_no_auto_restore']}, 10:57:32 INFO - 'svgr': {'tests': ['tsvgx', 10:57:32 INFO - 'tsvgr_opacity', 10:57:32 INFO - 'tart', 10:57:32 INFO - 'tscrollx', 10:57:32 INFO - 'cart']}, 10:57:32 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 10:57:32 INFO - 'tests': ['tsvgx', 10:57:32 INFO - 'tsvgr_opacity', 10:57:32 INFO - 'tart', 10:57:32 INFO - 'tscrollx', 10:57:32 INFO - 'cart']}, 10:57:32 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:57:32 INFO - 'tests': ['tp5o']}, 10:57:32 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:57:32 INFO - 'talos_options': ['--e10s'], 10:57:32 INFO - 'tests': ['tp5o']}, 10:57:32 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:57:32 INFO - 'talos_options': ['--xperf_path', 10:57:32 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:57:32 INFO - 'tests': ['tp5n']}, 10:57:32 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:57:32 INFO - 'talos_options': ['--e10s', 10:57:32 INFO - '--xperf_path', 10:57:32 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:57:32 INFO - 'tests': ['tp5n']}}, 10:57:32 INFO - 'talos.zip': {'path': '', 10:57:32 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:57:32 INFO - Running post-action listener: _resource_record_post_action 10:57:32 INFO - ##### 10:57:32 INFO - ##### Running create-virtualenv step. 10:57:32 INFO - ##### 10:57:32 INFO - Running pre-action listener: _resource_record_pre_action 10:57:32 INFO - Running main action method: create_virtualenv 10:57:32 INFO - Creating virtualenv /builds/slave/test/build/venv 10:57: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 10:57:32 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:57:32 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:57:32 INFO - Using real prefix '/tools/python27' 10:57:32 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:57:33 INFO - Installing distribute.............................................................................................................................................................................................done. 10:57:35 INFO - Installing pip.................done. 10:57:35 INFO - Return code: 0 10:57:35 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:57:35 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')]} 10:57:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:57:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57:35 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')]} 10:57:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:57:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x10db9ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dba54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa072cab6b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10da43d30>, '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 0x10d866db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10da39b20>, '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.ag6rmJaZu4/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.UDujEqUfXo/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 10:57:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 10:57:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 10:57:35 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ag6rmJaZu4/Render', 10:57:35 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:57:35 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:57:35 INFO - 'HOME': '/Users/cltbld', 10:57:35 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:57:35 INFO - 'LOGNAME': 'cltbld', 10:57:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:57:35 INFO - 'MOZ_NO_REMOTE': '1', 10:57:35 INFO - 'NO_EM_RESTART': '1', 10:57:35 INFO - 'PAGER': '/bin/cat', 10:57:35 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:57:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:57:35 INFO - 'PWD': '/builds/slave/test', 10:57:35 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:57:35 INFO - 'SHELL': '/bin/bash', 10:57:35 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UDujEqUfXo/Listeners', 10:57:35 INFO - 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/', 10:57:35 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:57:35 INFO - 'USER': 'cltbld', 10:57:35 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:57:35 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:57:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:57:35 INFO - 'XPC_FLAGS': '0x0', 10:57:35 INFO - 'XPC_SERVICE_NAME': '0', 10:57:35 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:57:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:57: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 10:57:36 INFO - Cleaning up... 10:57:36 INFO - Return code: 0 10:57:36 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 10:57: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')]} 10:57:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:57:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57: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')]} 10:57:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:57:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x10db9ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dba54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa072cab6b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10da43d30>, '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 0x10d866db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10da39b20>, '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.ag6rmJaZu4/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.UDujEqUfXo/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 10:57:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 10:57:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 10:57:36 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ag6rmJaZu4/Render', 10:57:36 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:57:36 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:57:36 INFO - 'HOME': '/Users/cltbld', 10:57:36 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:57:36 INFO - 'LOGNAME': 'cltbld', 10:57:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:57:36 INFO - 'MOZ_NO_REMOTE': '1', 10:57:36 INFO - 'NO_EM_RESTART': '1', 10:57:36 INFO - 'PAGER': '/bin/cat', 10:57:36 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:57:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:57:36 INFO - 'PWD': '/builds/slave/test', 10:57:36 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:57:36 INFO - 'SHELL': '/bin/bash', 10:57:36 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UDujEqUfXo/Listeners', 10:57:36 INFO - 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/', 10:57:36 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:57:36 INFO - 'USER': 'cltbld', 10:57:36 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:57:36 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:57:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:57:36 INFO - 'XPC_FLAGS': '0x0', 10:57:36 INFO - 'XPC_SERVICE_NAME': '0', 10:57:36 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:57:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:57:36 INFO - Downloading/unpacking psutil>=0.7.1 10:57:36 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 10:57:36 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 10:57:36 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 10:57:36 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 10:57:36 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 10:57:36 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 10:57:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:57:39 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:57:39 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:57:39 INFO - Installing collected packages: psutil 10:57:39 INFO - Running setup.py install for psutil 10:57:39 INFO - building 'psutil._psutil_osx' extension 10:57: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 10:57: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 10:57: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 10:57: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 10:57:40 INFO - building 'psutil._psutil_posix' extension 10:57: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 10:57:40 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 10:57:40 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 10:57:40 INFO - ^ 10:57:40 INFO - 1 warning generated. 10:57: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 10:57:40 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:57:40 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:57:40 INFO - Successfully installed psutil 10:57:40 INFO - Cleaning up... 10:57:40 INFO - Return code: 0 10:57:40 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 10:57: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')]} 10:57:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:57:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57: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')]} 10:57:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:57:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x10db9ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dba54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa072cab6b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10da43d30>, '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 0x10d866db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10da39b20>, '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.ag6rmJaZu4/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.UDujEqUfXo/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 10:57:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 10:57:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 10:57:40 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ag6rmJaZu4/Render', 10:57:40 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:57:40 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:57:40 INFO - 'HOME': '/Users/cltbld', 10:57:40 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:57:40 INFO - 'LOGNAME': 'cltbld', 10:57:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:57:40 INFO - 'MOZ_NO_REMOTE': '1', 10:57:40 INFO - 'NO_EM_RESTART': '1', 10:57:40 INFO - 'PAGER': '/bin/cat', 10:57:40 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:57:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:57:40 INFO - 'PWD': '/builds/slave/test', 10:57:40 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:57:40 INFO - 'SHELL': '/bin/bash', 10:57:40 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UDujEqUfXo/Listeners', 10:57:40 INFO - 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/', 10:57:40 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:57:40 INFO - 'USER': 'cltbld', 10:57:40 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:57:40 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:57:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:57:40 INFO - 'XPC_FLAGS': '0x0', 10:57:40 INFO - 'XPC_SERVICE_NAME': '0', 10:57:40 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:57:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:57:41 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 10:57:41 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 10:57:41 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 10:57:41 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 10:57:41 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 10:57:41 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 10:57:41 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 10:57:43 INFO - Downloading mozsystemmonitor-0.0.tar.gz 10:57:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:57: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) 10:57:43 INFO - Installing collected packages: mozsystemmonitor 10:57:43 INFO - Running setup.py install for mozsystemmonitor 10:57:43 INFO - Successfully installed mozsystemmonitor 10:57:43 INFO - Cleaning up... 10:57:43 INFO - Return code: 0 10:57:43 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:57: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')]} 10:57:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:57:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57: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')]} 10:57:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:57:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x10db9ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dba54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa072cab6b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10da43d30>, '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 0x10d866db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10da39b20>, '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.ag6rmJaZu4/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.UDujEqUfXo/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 10:57:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 10:57:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 10:57:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ag6rmJaZu4/Render', 10:57:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:57:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:57:43 INFO - 'HOME': '/Users/cltbld', 10:57:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:57:43 INFO - 'LOGNAME': 'cltbld', 10:57:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:57:43 INFO - 'MOZ_NO_REMOTE': '1', 10:57:43 INFO - 'NO_EM_RESTART': '1', 10:57:43 INFO - 'PAGER': '/bin/cat', 10:57:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:57:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:57:43 INFO - 'PWD': '/builds/slave/test', 10:57:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:57:43 INFO - 'SHELL': '/bin/bash', 10:57:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UDujEqUfXo/Listeners', 10:57:43 INFO - 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/', 10:57:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:57:43 INFO - 'USER': 'cltbld', 10:57:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:57:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:57:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:57:43 INFO - 'XPC_FLAGS': '0x0', 10:57:43 INFO - 'XPC_SERVICE_NAME': '0', 10:57:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:57:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:57:43 INFO - Downloading/unpacking blobuploader==1.2.4 10:57: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 10:57: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 10:57: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 10:57: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 10:57: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 10:57: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 10:57:46 INFO - Downloading blobuploader-1.2.4.tar.gz 10:57:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:57:46 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:57: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 10:57: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 10:57: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 10:57: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 10:57: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 10:57: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 10:57:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:57:47 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:57:47 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 10:57:47 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 10:57:47 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 10:57:47 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 10:57:47 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 10:57:47 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 10:57:47 INFO - Downloading docopt-0.6.1.tar.gz 10:57:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:57:47 INFO - Installing collected packages: blobuploader, requests, docopt 10:57:47 INFO - Running setup.py install for blobuploader 10:57:47 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:57:47 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:57:47 INFO - Running setup.py install for requests 10:57:48 INFO - Running setup.py install for docopt 10:57:48 INFO - Successfully installed blobuploader requests docopt 10:57:48 INFO - Cleaning up... 10:57:48 INFO - Return code: 0 10:57:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:57:48 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')]} 10:57:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:57:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57:48 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')]} 10:57:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:57:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--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 0x10db9ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dba54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa072cab6b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10da43d30>, '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 0x10d866db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10da39b20>, '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.ag6rmJaZu4/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.UDujEqUfXo/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 10:57:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--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 10:57:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --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 10:57:48 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ag6rmJaZu4/Render', 10:57:48 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:57:48 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:57:48 INFO - 'HOME': '/Users/cltbld', 10:57:48 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:57:48 INFO - 'LOGNAME': 'cltbld', 10:57:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:57:48 INFO - 'MOZ_NO_REMOTE': '1', 10:57:48 INFO - 'NO_EM_RESTART': '1', 10:57:48 INFO - 'PAGER': '/bin/cat', 10:57:48 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:57:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:57:48 INFO - 'PWD': '/builds/slave/test', 10:57:48 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:57:48 INFO - 'SHELL': '/bin/bash', 10:57:48 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UDujEqUfXo/Listeners', 10:57:48 INFO - 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/', 10:57:48 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:57:48 INFO - 'USER': 'cltbld', 10:57:48 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:57:48 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:57:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:57:48 INFO - 'XPC_FLAGS': '0x0', 10:57:48 INFO - 'XPC_SERVICE_NAME': '0', 10:57:48 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:57:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:57:48 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-NSEktq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:57:48 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-ZjWFjm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:57:48 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-f2pAAr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:57:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:57:48 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-SMLfwY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:57:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:57:49 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-wks7dB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:57:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:57:49 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-03xayu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:57:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:57:49 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-UJtUV5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:57:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:57:49 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-cUb4uV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:57:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:57:49 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-a5UwWG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:57:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:57:49 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-hZm7P_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:57:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:57:49 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-GyyqNf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:57:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:57:49 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-Me9dZ9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:57:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:57:49 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-Q7wPfD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:57:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:57:50 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-vKSGMt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:57:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:57:50 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-TytBww-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:57:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:57:50 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-BRHgBe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:57:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:57:50 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-K4K8K5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:57:50 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:57:50 INFO - Running setup.py install for manifestparser 10:57:50 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:57:50 INFO - Running setup.py install for mozcrash 10:57:50 INFO - Running setup.py install for mozdebug 10:57:50 INFO - Running setup.py install for mozdevice 10:57:51 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:57:51 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:57:51 INFO - Running setup.py install for mozfile 10:57:51 INFO - Running setup.py install for mozhttpd 10:57:51 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:57:51 INFO - Running setup.py install for mozinfo 10:57:51 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:57:51 INFO - Running setup.py install for mozInstall 10:57:51 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:57:51 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:57:51 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:57:51 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:57:51 INFO - Running setup.py install for mozleak 10:57:51 INFO - Running setup.py install for mozlog 10:57:51 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:57:51 INFO - Running setup.py install for moznetwork 10:57:52 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:57:52 INFO - Running setup.py install for mozprocess 10:57:52 INFO - Running setup.py install for mozprofile 10:57:52 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:57:52 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:57:52 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:57:52 INFO - Running setup.py install for mozrunner 10:57:52 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:57:52 INFO - Running setup.py install for mozscreenshot 10:57:52 INFO - Running setup.py install for moztest 10:57:52 INFO - Running setup.py install for mozversion 10:57:52 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:57:52 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:57:52 INFO - Cleaning up... 10:57:52 INFO - Return code: 0 10:57:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:57: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')]} 10:57:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:57:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57: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')]} 10:57:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:57:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x10db9ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dba54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa072cab6b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10da43d30>, '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 0x10d866db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10da39b20>, '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.ag6rmJaZu4/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.UDujEqUfXo/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 10:57:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 10:57:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 10:57:52 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ag6rmJaZu4/Render', 10:57:52 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:57:52 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:57:52 INFO - 'HOME': '/Users/cltbld', 10:57:52 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:57:52 INFO - 'LOGNAME': 'cltbld', 10:57:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:57:52 INFO - 'MOZ_NO_REMOTE': '1', 10:57:52 INFO - 'NO_EM_RESTART': '1', 10:57:52 INFO - 'PAGER': '/bin/cat', 10:57:52 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:57:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:57:52 INFO - 'PWD': '/builds/slave/test', 10:57:52 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:57:52 INFO - 'SHELL': '/bin/bash', 10:57:52 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UDujEqUfXo/Listeners', 10:57:52 INFO - 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/', 10:57:52 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:57:52 INFO - 'USER': 'cltbld', 10:57:52 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:57:52 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:57:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:57:52 INFO - 'XPC_FLAGS': '0x0', 10:57:52 INFO - 'XPC_SERVICE_NAME': '0', 10:57:52 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:57:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:57:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:57:53 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-Qx3pjt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:57:53 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)) 10:57:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:57:53 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-i4GUzT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:57:53 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)) 10:57:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:57:53 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-1y7aQO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:57:53 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)) 10:57:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:57:53 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-vGlJVT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:57:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 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)) 10:57:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:57:53 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-xMZI4v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:57: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)) 10:57:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:57:53 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-TtxCIb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:57: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)) 10:57:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:57:53 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-23KdvM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:57: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)) 10:57:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:57:53 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-gFJlHR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:57:54 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)) 10:57:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:57:54 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-hgXp1C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:57:54 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)) 10:57:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:57:54 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-Cr2aVe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:57:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 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)) 10:57:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:57:54 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-Di81jx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:57:54 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)) 10:57:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:57:54 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-cmyWaN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:57:54 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)) 10:57:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:57:54 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-5Dn43H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:57:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 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)) 10:57:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:57:54 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-DWRrYh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:57: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)) 10:57:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:57:54 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-WPtdnR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:57: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)) 10:57:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:57:54 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-lPv6at-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:57: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)) 10:57:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:57:54 INFO - Running setup.py (path:/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/pip-e7O7lF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:57:55 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)) 10:57:55 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)) 10:57:55 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)) 10:57:55 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)) 10:57:55 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:57:55 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 10:57:55 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:57:55 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 10:57:55 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 10:57:55 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 10:57:55 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 10:57:55 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 10:57:55 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 10:57:57 INFO - Downloading blessings-1.6.tar.gz 10:57:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:57:57 INFO - Installing collected packages: blessings 10:57:57 INFO - Running setup.py install for blessings 10:57:57 INFO - Successfully installed blessings 10:57:57 INFO - Cleaning up... 10:57:57 INFO - Return code: 0 10:57:57 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:57:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:57:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:57:58 INFO - Reading from file tmpfile_stdout 10:57:58 INFO - Current package versions: 10:57:58 INFO - blessings == 1.6 10:57:58 INFO - blobuploader == 1.2.4 10:57:58 INFO - docopt == 0.6.1 10:57:58 INFO - manifestparser == 1.1 10:57:58 INFO - mozInstall == 1.12 10:57:58 INFO - mozcrash == 0.16 10:57:58 INFO - mozdebug == 0.1 10:57:58 INFO - mozdevice == 0.48 10:57:58 INFO - mozfile == 1.2 10:57:58 INFO - mozhttpd == 0.7 10:57:58 INFO - mozinfo == 0.9 10:57:58 INFO - mozleak == 0.1 10:57:58 INFO - mozlog == 3.1 10:57:58 INFO - moznetwork == 0.27 10:57:58 INFO - mozprocess == 0.22 10:57:58 INFO - mozprofile == 0.28 10:57:58 INFO - mozrunner == 6.11 10:57:58 INFO - mozscreenshot == 0.1 10:57:58 INFO - mozsystemmonitor == 0.0 10:57:58 INFO - moztest == 0.7 10:57:58 INFO - mozversion == 1.4 10:57:58 INFO - psutil == 3.1.1 10:57:58 INFO - requests == 1.2.3 10:57:58 INFO - wsgiref == 0.1.2 10:57:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:57:58 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')]} 10:57:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:57:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57:58 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')]} 10:57:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:57:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x10db9ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dba54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa072cab6b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10da43d30>, '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 0x10d866db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10da39b20>, '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.ag6rmJaZu4/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.UDujEqUfXo/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 10:57:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 10:57:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 10:57:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ag6rmJaZu4/Render', 10:57:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:57:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:57:58 INFO - 'HOME': '/Users/cltbld', 10:57:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:57:58 INFO - 'LOGNAME': 'cltbld', 10:57:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:57:58 INFO - 'MOZ_NO_REMOTE': '1', 10:57:58 INFO - 'NO_EM_RESTART': '1', 10:57:58 INFO - 'PAGER': '/bin/cat', 10:57:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:57:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:57:58 INFO - 'PWD': '/builds/slave/test', 10:57:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:57:58 INFO - 'SHELL': '/bin/bash', 10:57:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UDujEqUfXo/Listeners', 10:57:58 INFO - 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/', 10:57:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:57:58 INFO - 'USER': 'cltbld', 10:57:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:57:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:57:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:57:58 INFO - 'XPC_FLAGS': '0x0', 10:57:58 INFO - 'XPC_SERVICE_NAME': '0', 10:57:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:57:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:57:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 10:57:58 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 2)) 10:57:58 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 3)) 10:57:58 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 4)) 10:57:58 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 5)) 10:57:58 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 6)) 10:57:58 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 7)) 10:57:58 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 8)) 10:57:58 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 9)) 10:57:58 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.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 10:57:58 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 4)) 10:57:58 INFO - Cleaning up... 10:57:58 INFO - Return code: 0 10:57:58 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:57:58 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')]} 10:57:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:57:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57:58 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')]} 10:57:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:57:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:57:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10db9ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dba54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa072cab6b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10da43d30>, '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 0x10d866db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10da39b20>, '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.ag6rmJaZu4/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.UDujEqUfXo/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 10:57:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'jsonschema'] in /builds/slave/test/build 10:57:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 jsonschema 10:57:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ag6rmJaZu4/Render', 10:57:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:57:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:57:58 INFO - 'HOME': '/Users/cltbld', 10:57:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:57:58 INFO - 'LOGNAME': 'cltbld', 10:57:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:57:58 INFO - 'MOZ_NO_REMOTE': '1', 10:57:58 INFO - 'NO_EM_RESTART': '1', 10:57:58 INFO - 'PAGER': '/bin/cat', 10:57:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:57:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:57:58 INFO - 'PWD': '/builds/slave/test', 10:57:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:57:58 INFO - 'SHELL': '/bin/bash', 10:57:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UDujEqUfXo/Listeners', 10:57:58 INFO - 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/', 10:57:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:57:58 INFO - 'USER': 'cltbld', 10:57:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:57:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:57:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:57:58 INFO - 'XPC_FLAGS': '0x0', 10:57:58 INFO - 'XPC_SERVICE_NAME': '0', 10:57:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:57:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:57:58 INFO - Downloading/unpacking jsonschema 10:57:58 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 10:57:58 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 10:57:58 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 10:57:58 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 10:57:58 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 10:57:58 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 10:58:01 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:58:01 INFO - Downloading/unpacking functools32 (from jsonschema) 10:58:01 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 10:58:01 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 10:58:01 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 10:58:01 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 10:58:01 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 10:58:01 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 10:58:01 INFO - Downloading functools32-3.2.3-2.tar.gz 10:58:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:58:01 INFO - warning: no files found matching '*.txt' 10:58:01 INFO - no previously-included directories found matching 'build' 10:58:01 INFO - no previously-included directories found matching 'dist' 10:58:01 INFO - no previously-included directories found matching '.git*' 10:58:01 INFO - Installing collected packages: jsonschema, functools32 10:58:01 INFO - Running setup.py install for functools32 10:58:01 INFO - warning: no files found matching '*.txt' 10:58:01 INFO - no previously-included directories found matching 'build' 10:58:01 INFO - no previously-included directories found matching 'dist' 10:58:01 INFO - no previously-included directories found matching '.git*' 10:58:02 INFO - Successfully installed jsonschema functools32 10:58:02 INFO - Cleaning up... 10:58:02 INFO - Return code: 0 10:58:02 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 10:58:02 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')]} 10:58:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:58:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:58:02 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')]} 10:58:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:58:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:58:02 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10db9ea30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10dba54c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa072cab6b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10da43d30>, '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 0x10d866db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10da39b20>, '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.ag6rmJaZu4/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.UDujEqUfXo/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 10:58:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'flake8'] in /builds/slave/test/build 10:58:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 flake8 10:58:02 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ag6rmJaZu4/Render', 10:58:02 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:58:02 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:58:02 INFO - 'HOME': '/Users/cltbld', 10:58:02 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:58:02 INFO - 'LOGNAME': 'cltbld', 10:58:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:58:02 INFO - 'MOZ_NO_REMOTE': '1', 10:58:02 INFO - 'NO_EM_RESTART': '1', 10:58:02 INFO - 'PAGER': '/bin/cat', 10:58:02 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:58:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:58:02 INFO - 'PWD': '/builds/slave/test', 10:58:02 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:58:02 INFO - 'SHELL': '/bin/bash', 10:58:02 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UDujEqUfXo/Listeners', 10:58:02 INFO - 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/', 10:58:02 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:58:02 INFO - 'USER': 'cltbld', 10:58:02 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:58:02 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:58:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:58:02 INFO - 'XPC_FLAGS': '0x0', 10:58:02 INFO - 'XPC_SERVICE_NAME': '0', 10:58:02 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:58:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:58:02 INFO - Downloading/unpacking flake8 10:58:02 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 10:58:02 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 10:58:02 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 10:58:02 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 10:58:02 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 10:58:02 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 10:58:04 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 10:58:04 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 10:58:04 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 10:58:04 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 10:58:04 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 10:58:04 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 10:58:04 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 10:58:04 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 10:58:05 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 10:58:05 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 10:58:05 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 10:58:05 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 10:58:05 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 10:58:05 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 10:58:05 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 10:58:05 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 10:58:05 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 10:58:05 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 10:58:05 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 10:58:05 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 10:58:05 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 10:58:05 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 10:58:05 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 10:58:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 10:58:06 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:58:06 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:58:06 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:58:06 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:58:06 INFO - no previously-included directories found matching 'docs/_build' 10:58:06 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 10:58:06 INFO - Running setup.py install for pep8 10:58:06 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 10:58:06 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 10:58:06 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 10:58:06 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 10:58:06 INFO - no previously-included directories found matching 'docs/_build' 10:58:06 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 10:58:06 INFO - Successfully installed flake8 mccabe pyflakes pep8 10:58:06 INFO - Cleaning up... 10:58:06 INFO - Return code: 0 10:58:06 INFO - Running post-action listener: _resource_record_post_action 10:58:06 INFO - Running post-action listener: _start_resource_monitoring 10:58:06 INFO - Starting resource monitoring. 10:58:06 INFO - ##### 10:58:06 INFO - ##### Running install step. 10:58:06 INFO - ##### 10:58:06 INFO - Running pre-action listener: _resource_record_pre_action 10:58:06 INFO - Running main action method: install 10:58:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:58:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:58:06 INFO - Reading from file tmpfile_stdout 10:58:06 INFO - Detecting whether we're running mozinstall >=1.0... 10:58:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:58:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:58:06 INFO - Reading from file tmpfile_stdout 10:58:06 INFO - Output received: 10:58:06 INFO - Usage: mozinstall [options] installer 10:58:06 INFO - Options: 10:58:06 INFO - -h, --help show this help message and exit 10:58:06 INFO - -d DEST, --destination=DEST 10:58:06 INFO - Directory to install application into. [default: 10:58:06 INFO - "/builds/slave/test"] 10:58:06 INFO - --app=APP Application being installed. [default: firefox] 10:58:06 INFO - mkdir: /builds/slave/test/build/application 10:58:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 10:58:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 10:58:41 INFO - Reading from file tmpfile_stdout 10:58:41 INFO - Output received: 10:58:41 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 10:58:41 INFO - Running post-action listener: _resource_record_post_action 10:58:41 INFO - ##### 10:58:41 INFO - ##### Running run-tests step. 10:58:41 INFO - ##### 10:58:41 INFO - Running pre-action listener: _resource_record_pre_action 10:58:41 INFO - Running main action method: run_tests 10:58:41 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 10:58:41 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 10:58:41 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 10:58:41 INFO - 2016-02-07 10:58:41.094 screenresolution[1659:8289] starting screenresolution argv=screenresolution get 10:58:41 INFO - 2016-02-07 10:58:41.096 screenresolution[1659:8289] Display 0: 1600x1200x32@60 10:58:41 INFO - 2016-02-07 10:58:41.101 screenresolution[1660:8291] starting screenresolution argv=screenresolution list 10:58:41 INFO - Available Modes on Display 0 10:58:41 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 10:58:41 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 10:58:41 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 10:58:41 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 10:58:41 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 10:58:41 INFO - Intel Iris: 10:58:41 INFO - Chipset Model: Intel Iris 10:58:41 INFO - Type: GPU 10:58:41 INFO - Bus: Built-In 10:58:41 INFO - VRAM (Dynamic, Max): 1536 MB 10:58:41 INFO - Vendor: Intel (0x8086) 10:58:41 INFO - Device ID: 0x0a2e 10:58:41 INFO - Revision ID: 0x0009 10:58:41 INFO - Displays: 10:58:41 INFO - Display: 10:58:41 INFO - Resolution: 1600 x 1200 @ 60 Hz 10:58:41 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 10:58:41 INFO - Display Serial Number: 1600x1200 60 10:58:41 INFO - Main Display: Yes 10:58:41 INFO - Mirror: Off 10:58:41 INFO - Online: Yes 10:58:41 INFO - Rotation: Supported 10:58:41 INFO - Return code: 0 10:58:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:58:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:58:41 INFO - Python 2.7.3 10:58:41 INFO - Return code: 0 10:58:41 INFO - grabbing minidump binary from tooltool 10:58:41 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')]} 10:58:41 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 0x10da43d30>, '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 0x10d866db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10da39b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:58:41 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 10:58:41 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 10:58:41 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:58:41 INFO - Return code: 0 10:58:41 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 10:58:41 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:58:41 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:58:41 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 10:58:41 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:58:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 10:58:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 10:58:42 INFO - Return code: 0 10:58:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0066', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 10:58:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0066 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 10:58:42 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ag6rmJaZu4/Render', 10:58:42 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 10:58:42 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 10:58:42 INFO - 'HOME': '/Users/cltbld', 10:58:42 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 10:58:42 INFO - 'LOGNAME': 'cltbld', 10:58:42 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:58:42 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 10:58:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:58:42 INFO - 'MOZ_NO_REMOTE': '1', 10:58:42 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:58:42 INFO - 'NO_EM_RESTART': '1', 10:58:42 INFO - 'PAGER': '/bin/cat', 10:58:42 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 10:58:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:58:42 INFO - 'PWD': '/builds/slave/test', 10:58:42 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:58:42 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 10:58:42 INFO - 'SHELL': '/bin/bash', 10:58:42 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UDujEqUfXo/Listeners', 10:58:42 INFO - 'TMPDIR': '/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/', 10:58:42 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 10:58:42 INFO - 'USER': 'cltbld', 10:58:42 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 10:58:42 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 10:58:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:58:42 INFO - 'XPC_FLAGS': '0x0', 10:58:42 INFO - 'XPC_SERVICE_NAME': '0', 10:58:42 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 10:58:42 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0066', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 10:58:42 INFO - mozversion application_buildid: 20160207090759 10:58:42 INFO - mozversion application_changeset: baf5ffa90789d6f27154f6dee50111eebceaeb26 10:58:42 INFO - mozversion application_display_name: Nightly 10:58:42 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:58:42 INFO - mozversion application_name: Firefox 10:58:42 INFO - mozversion application_remotingname: firefox 10:58:42 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 10:58:42 INFO - mozversion application_vendor: Mozilla 10:58:42 INFO - mozversion application_version: 47.0a1 10:58:42 INFO - mozversion platform_buildid: 20160207090759 10:58:42 INFO - mozversion platform_changeset: baf5ffa90789d6f27154f6dee50111eebceaeb26 10:58:42 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 10:58:42 INFO - mozversion platform_version: 47.0a1 10:58:42 INFO - using testdate: 1454871522 10:58:42 INFO - actual date: 1454871522 10:58:43 INFO - starting webserver on 'localhost:49285' 10:58:43 INFO - SUITE-START | Running 2 tests 10:58:43 INFO - TEST-START | dromaeo_css 10:58:43 INFO - operating with platform_type : mac_ 10:58:43 INFO - Initialising browser for dromaeo_css test... 10:58:43 INFO - TEST-INFO | started process 1678 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/tmphR18_j/profile http://localhost:49285/getInfo.html) 10:58:45 INFO - PROCESS | 1678 | __metrics Screen width/height:1600/1200 10:58:45 INFO - PROCESS | 1678 | colorDepth:24 10:58:45 INFO - PROCESS | 1678 | Browser inner width/height: 1024/689 10:58:45 INFO - PROCESS | 1678 | __metrics 10:58:45 INFO - PROCESS | 1678 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 668: Error: Phase "quit-application-granted is finished, it is too late to register completion condition "SessionStore: flushing all windows" 10:58:45 INFO - PROCESS | 1678 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:58:46 INFO - TEST-INFO | 1678: exit 0 10:58:46 INFO - Browser initialized. 10:58:46 INFO - Running cycle 1/1 for dromaeo_css test... 10:58:46 INFO - TEST-INFO | started process 1682 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/tmphR18_j/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:58:58 INFO - PROCESS | 1682 | RSS: Main: 245354496 10:58:58 INFO - PROCESS | 1682 | 10:59:49 INFO - PROCESS | 1682 | 1454871589390 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] 11:01:58 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49285/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49285/tests/dromaeo/cssquery-ext.html) 11:02:01 INFO - PROCESS | 1682 | RSS: Main: 466083840 11:02:01 INFO - PROCESS | 1682 | 11:05:04 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49285/tests/dromaeo/cssquery-ext.html (next: http://localhost:49285/tests/dromaeo/cssquery-jquery.html) 11:05:04 INFO - PROCESS | 1682 | RSS: Main: 384163840 11:05:04 INFO - PROCESS | 1682 | 11:08:06 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49285/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49285/tests/dromaeo/cssquery-mootools.html) 11:08:07 INFO - PROCESS | 1682 | RSS: Main: 382558208 11:08:07 INFO - PROCESS | 1682 | 11:11:09 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49285/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49285/tests/dromaeo/cssquery-prototype.html) 11:11:10 INFO - PROCESS | 1682 | RSS: Main: 381812736 11:11:10 INFO - PROCESS | 1682 | 11:14:13 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49285/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49285/tests/dromaeo/cssquery-yui.html) 11:14:13 INFO - PROCESS | 1682 | RSS: Main: 358834176 11:14:13 INFO - PROCESS | 1682 | 11:17:16 INFO - PROCESS | 1682 | Cycle 1(1): loaded http://localhost:49285/tests/dromaeo/cssquery-yui.html (next: http://localhost:49285/tests/dromaeo/cssquery-dojo.html) 11:17:16 INFO - PROCESS | 1682 | RSS: Main: 392257536 11:17:16 INFO - PROCESS | 1682 | 11:17:16 INFO - PROCESS | 1682 | __start_tp_report 11:17:16 INFO - PROCESS | 1682 | _x_x_mozilla_page_load 11:17:16 INFO - PROCESS | 1682 | _x_x_mozilla_page_load_details 11:17:16 INFO - PROCESS | 1682 | |i|pagename|runs| 11:17:16 INFO - PROCESS | 1682 | |0;dojo.html;3430.0910258781423;3462.636423175565;3489.354469423156;3506.1760486285702;3527.2416430467442;4586.793594288257;4901.509849015101;5434.510894019538;5634.690092044936;5661.924234395462;5635.520980716644;5659.943400565993;5664.971675141629;5782.479576838084;5796.275465566804;5051.772670229849;5104.310918026074;5133.563647090002;5135.64050516464;5308.23030660554;4415.66882483815;5273;5288.550473209782;5319.707416092114;5348.866278343034;5117.872053198663;5132.5124113209185;5202.479752024805;5218.086834803932;5232.084385232607;5132.897342053138;5178.533931946105;5179.792808287664;5180.974095129538;5189.922151167735;5124.308218390507;5147.176451767737;5180.171172612401;5185.066687996159;5191.740412979336;5465.289512363367;5532.529734972532;5564.666120032771;5570.888582228374;5634.690092044936;6156;6181.474574661159;6185.35053819347;6193.5354848386105;6194.783182588588;5308.70802105884;5792.565557583156;6212.72042758077;6216.254049514042;6249.312575616678;5613.326400831845;5630.915536266959;5647.802326918538;5660.660360378391;5665.461781130786;6258.374162583706;6276.717547710364;6286.591371560834;6338.080978258126;6380.425761681471;6027.36712645166;6073.453389194994;6083.787067452707;6099.878002440015;6118.479929205978;6210.596311239755;6237.750489980441;6262.436380725757;6267.7806276781;6267.874642507124;6000.579959402888;6128.662923539159;6143.477804386677;6168;6169.56813023093;6167.629942203482;6184.474319682878;6196.752129914753;6197.938020619736;6202.534809889276;4785.210440277316;4806.903861922742;4862.124817532878;4876.683015603974;4906.337644417958;4292.420523229386;4345.782710864444;4363.563643635611;4371.23503386906;4418.33724941255;5652.745626446737;5664.461876121762;5676.971615141898;5697.601167918206;5719.428057194247;6125.877482450326;6156.015037594053;6254.093156492283;6256.593321434092;6266.216722909637;5605.0751625982075;5627.831165065055;5631.465010823965;5639.013172694762;5646.971765141148;4726.747411935839;5260.631755777135;5283;5310.123829568155;5314.468553144655;6171.197744293213;6315.842103947438;6319.968400158062;6328.462080723098;6336.303006669263;6155.230596175478;6206.379362063757;6209.813705588839;6210.068489726577;6238.282597501346;6247.468965138014;6248.531360148098;6321.936780632319;6326.9876819708625;6359.427651511386;6107.431569637723;6122.611623597813;6122.886318443891;6133.028644417115;6147.924113280247;6137.966867168879;6207.286162091417;6214;6224.37756224374;6226.59527130735;5824.767009319749;5932.2584676915385;5934.910976335272;5940.970295148497;5949;5303.681779093266;5633.549316054624;5903.468687818117;5917.230760001173;5931.169636251015;5423.915216956546;5759.827205183851;5779.682117483579;5786.681732504584;5791;5305.9204111939125;5847.771967886792;5870.765169393177;5945.851353716192;6039.6678182698615;5877.794277200277;5884.735186916685;5893.263342082239;5898.469137777621;5900.262467191601 11:17:16 INFO - PROCESS | 1682 | |1;ext.html;430.1289887976848;481.5906479492431;483.6602610768172;579.904315787895;615.9322474527801;30088;37954.86135415935;38557.42163867544;38666.226675466474;38704.22591548167;41525.58474415255;41688.58311416893;41787.164256714925;41828;42079.78960105203;9448.34653935562;9629.614815407374;9692.176165025981;9695.17591004762;9706.466144362057;9593.280503962196;9727.07592778685;9742.561584728704;9776.266779991494;9870.802583948316;9801;9897.257705672067;9899.356541824758;9899.50502474877;9914.801703965917;9778.217742580577;9862.950685246527;9865.60537578496;9877.90122098777;9880.65417710384;9633.90366096344;9714.31999760017;9768.97425770291;9769.218462522982;9770.36492627984;39834.60165398367;40224;40232.99417514556;40276.59723402787;40320.39519407211;3032.3935212957276;3132.9974408189387;3163.9209019774457;3218.452863013293;3466.7053300469493;28089.719102808915;29077.273068173465;29543.556846647316;29558.408831823457;29813;2669.626252324676;2760.7653349465318;2785.902493412741;2795.594638777366;2817.8027538072342;485270;486412;487270;488460;489933;55790;56651.58371040757;56837.715811421505;56898.43101569014;57034.85930281371;68105;70165.64917175382;70210;70261.94607080898;70309.64845175741;15573.377064917277;16061.11663858499;16065.277062532214;16069.919650401673;16088.517344479684;11231.606893758679;11590.478428470738;12226.633201003984;12320.260784352968;12359.75280494403;19569.1193896275;19796.60406791856;19858.60282794336;19860.801391986184;20266.89866550658;8702.47785132894;8834.514101724339;8884.333674974403;8907.73276801697;8909.198172164406;930.181440332503;948.3456415073715;1006.4464544500496;1065.648336049102;1080.9189310801721;23927.880360598432;25383.36541586438;29247.415051699274;29498.55752163719;29757.702422975926;1083.815751322277;1092.2736380307165;1128.853249077631;1139.7207684117445;1156.7108222944264;12592.874071259354;15145.122426738884;15178.848211517965;15195.520734488135;15208.08751474915;537914;543885;544009;544729;547751;57528.71235643879;58161;58210.70894645499;58238;58294;1188.9464974076188;1205.879412058787;1317.5849607373646;1375.2917247617486;1444.0469290268372;28660.57009144823;28774.424511509234;28812;29265.707342926296;29365.09126906744;45364.77317613391;45832.7708361456;45920.770396147804;45935;46006;456112;525099;532943;533526;534627;28561;28720.281992950342;28923.710762892944;28955.855220723763;29016.56475152832;39677.80161099176;40211.8397998743;40315.79842100888;40385;40558.39162412625;31907.36185276235;34567.481487778205;34860.82569587136;35088.29823403569;35274.294514110086;34679.13302167466;35332.47001295034;35604.01543783821;35695.82152089223;35726.28547429089;35542;35768;35824.46263306;35960.10099747423;37154.442683360314;29634;30716.23209419693;30831.383372332875;30859.2285192863;30950.690493094782;23658.88170559136;23726.169584064475;23757.524849503257;24092.638610421207;24155.75844241535 11:17:16 INFO - PROCESS | 1682 | |2;jquery.html;350.2574541971021;358.28343313373256;362.3242652453174;369.16016063455635;370.20406126827334;14135.575932722035;15239.31423085961;18593.7210941836;19348.226070957164;19872.205111795512;19524.90237548814;19765.81405115694;20218.797812021876;20288.69566956493;20323.695144572805;6264.906026409608;6439.291677915449;6467.353264673518;6490.253620833594;6499.382558656944;4574.771261436931;4785.880352991168;6353.983362661975;6401.8399540011405;7256.092988376453;7033.191183013968;7046.295370462964;7232.168300645414;7246.311600397954;7267.30960558746;7101.89347159793;7142;7214.8557028859395;7242.746503872392;7282.599457029861;6914.757983470605;6979.336962988508;6990.161180658302;6995.09063821705;7003.8599228015155;24903.377415564573;25119;25514.617280740804;25670.22989310324;26086.087386743682;2342.7188737351457;2422.2975337152207;2446.4862378900452;2497.5254701606636;2629.671291088614;14615.488457904028;14663.63340916475;14891.851081489154;15517.922410387988;15520.301586428637;1824.6350729854082;1833.8074502177346;1862.3109449503636;1881.2192939929912;1934.0813113770987;100810;101818.47272290921;102643.46034809409;103600.96399036064;110891.68312376604;9455.810883782286;9811.362261452983;10184.643537476153;10933.617323393642;11238.325700458;13518.188908665512;13571.728565428833;13577.456901723821;13590.59228223155;13610.863891361158;8226.341892648574;8340.582970851434;8368.58157092143;8406.201410865959;8438.620262088221;8394.202550757669;8411.495310281403;8428.32573394127;8475.74572762818;8514.659413623509;4054.432379466877;4201.894952626209;4386.890327741832;4459.7547134907245;4499.707519011254;1736.6714463435483;1757.9912100439417;1806.5032116168159;1811.5815386459224;1816.845568126724;874.8731433942042;913.4382354851718;995.4326034160459;1000.7948370584159;1018.3482571154467;15981.840181598267;18758.624827503372;19445.708314375297;19719.915404652882;19793.703094453595;914.2642055162981;920.7513971227731;937.5687183895484;946.3753922411175;947.7014740356904;8874.010835008745;10485.633002844865;10683.25217234786;10697.572097116185;10809.783804324026;575661;576190.4287535799;582862;657582;667654;95428;118016.40991794986;122160.16759748434;122537.38731306465;125861.11208331882;1013.1793247469574;1187.9643610691694;1197.1500234833366;1214.4595654933646;1233.6977440527128;15129.773053403987;17547.824521754617;18313.816861831743;18413;18685.439436816916;46546;46719.76640116778;47456.7627161862;47780.7610961943;48265;61820.072698908654;62002;62229.37770622236;63117.42206444692;63913.72172556616;7449.515781474187;7565.356944659766;7585.506942048749;7673.232676732282;7728.304452599293;9591.952040239754;11880.34658093813;11942.820857687315;12013.75972480563;12194.390280486117;10397.272190946864;10517.9474102629;10614.787704246026;10665;10712.19658525598;8667.739967800977;9906.752331191778;10338.689839304832;10410.479476026017;10476.16190704757;9038.593263303299;9821.950890245504;10551.261411701415;10644.254902156774;10810.945945270538;7495.925040749523;7610.771676849482;7611.961940190264;7622.123455802654;7641.312281894656;8456.577171141294;10427.791444171226;10495.317804342692;10542.947285263524;10698.465076745975 11:17:16 INFO - PROCESS | 1682 | |3;mootools.html;1352.3170798746644;1449.2753623188405;1475.8376578576356;1628.332383722674;1669.7996240451141;7743.457957942946;8333.166683331672;8487.151284871525;8515.403921725474;8525.275351595123;8256.298214651762;8511.319094472443;8519.148085191493;8521.233089021987;8530.146985301466;1977.9307724229618;2107.7049213110176;2166.7183266175375;2168.5229249565073;2383.9642405363934;2349.9647505287435;2416.9879150604224;2417.033186725306;2417.468157005456;2420.092465325503;2332.6384410416413;2344.460774021976;2379.4527258730504;2386.2721869829693;2388.2477019738812;2348.8003519700674;2350.8824558771994;2360.6459031145378;2391.8445301055376;2396.3769419950763;2365.988170059156;2392.377981724747;2402.903883844662;2403.987980060106;2405.314485371661;8576.185262400062;8591.26974207193;8592.484450932901;8607.870881936777;8624.568771561397;5165.457626949154;5269.815556455505;5277.1820367842665;5293.444188360205;5312.468753124656;3408.352413041514;3490.0402389343135;3518.3315170117853;3530.3645343838098;3534.540509733744;1031.9845202321972;1039.4698703661188;1051.3008849115329;1061.6655753437642;1070.1920050362005;11775.882241177564;11802.055835533136;11821.822672659917;11825.172237943347;11831.881681183164;4725.149473094807;4731.79971313334;4791.712497250106;4793.952060479351;4805.327254184417;9959;9965.850512242323;9968.850467242997;9983.003399320165;9983.500824958723;5295.708736019479;5322.520973112439;5342.2253773202665;5348.491893270133;5349.358077030781;4815.061063092733;4877.658563900563;4882.145624515695;4882.5605695487575;4888;3603.9728677326834;3678.319510890494;3686.1337585667347;3695.519582454264;3882.242962622318;1197.3655959615062;1254.2035807262455;1277.5081593586535;1295.080492850087;1297.9740405191844;1297.4939773488347;1311.1346511302686;1341.0478560222157;1342.3355439057534;1342.5032737887045;7903.604819758989;7909.52542847431;8224.38317126206;8233.670653173805;8262.958685206535;993.6323560282742;1156.4622450560362;1162.808136657459;1165.830954511591;1195.1872726545857;5440.700761458079;6249.6562689051625;6257.7184026718;6269.435750782452;6272.937270627326;9888.258380621483;10452.843207351896;10539.104176145114;10557.894421055844;10609.89390106089;10356.844647330296;10504.002119798606;10548.578056877639;10578.153747700166;10590.993855583707;8011.479253848481;8181.100078991306;8192.713255036046;8202.015758109184;8206.05630352517;7510.286522780327;7701.268379503938;7746.57393843344;7747.845043099219;7774.144844067261;7905.486143400661;8068.87896681562;9234;9512.239020878174;9607.375520591138;9647.807043859224;9775.560099795384;9797.902020979698;9841.60633574649;9846.507674616098;7258.455615828729;7368.705251789868;7370.336669699753;7376.151742549676;7384.52000619958;7090.113735783028;7834;7930.722424715107;7942.967414236113;7956.403269754675;7006.684699188447;7163.6060016699585;7355.889661654973;7519.736809211651;7535.397168226638;7155.677994490365;7241.239669834592;7312.5246858954;7365.1530074042175;7393;7397.889031664637;7431.739889103856;7435.9628201860805;7445.9627701861145;7470.887936680845;6715.462762978852;6745.156855393076;6748.5613435128525;6769;6787.762428314985;6871.759488417882;6920.5847649141215;6932.341427564374;7003.824904377431;7005.404540614105 11:17:16 INFO - PROCESS | 1682 | |4;prototype.html;316.75768037451354;325.14324754272485;329.94555898276786;330.52734589536954;335.0467918771095;6374.681265936708;6452.4192822645955;6456.612603243809;6476.287608363076;6568.573042752218;6267.780627678032;6452.4192822645955;6498.902516462257;6501.707423165957;6522.543421960465;4893.41279046515;4893.437254715717;4900.166971614834;4902.583280421169;4907.263910413449;3956.030772460751;4621.976890115561;4737.834175803848;4748.90502189956;4857.708537487744;4742;4785.090832741768;4790.856274311759;4807.951920480803;4825.806967721304;4822.204336284544;4843.733594652275;4848.369711937443;4857.441394239672;4864.78108485119;4165.770882601456;4166.458360413127;4169.0411205422615;4172.749635021878;4176.14389050244;4873.31773551703;6299.149614801989;6333.113364129025;6379.585326953733;6397.5521713480075;5671.270262569915;5681.147827825818;5692.402297758717;5711.571632127607;5743.827685169452;6230.345813689588;6626.204855417381;6988.860222795566;6999.475039372068;7029.2619274975905;4576.885577860547;4649.767511624439;4658.138244424758;4659.254519276933;4665.440147182359;7223.819404514877;7349.70601175947;7363.705451781922;7370.8894366584545;7400.296971787618;4211.431456753299;4739.502352253033;4742.857714268577;4749.810007599657;4762.476127625959;4379.386885835986;4838.225883858566;4844.297576851337;4845.273209018605;4850;5656.971715141481;5666.631668941505;5681.0910254359105;5686.857828554319;5705.087186050212;6990.720371185095;7011.89482157768;7018.227994920555;7019.262977387403;7024.086868707138;1391.54079153881;1621.4649165775265;1648.2006226979904;1674.054159399935;1683.318256106279;1079.1312993040522;1088.3089238333557;1088.8149014667526;1100.301308669001;1100.5322737836389;6550.803475895731;6553.377429144223;6566.310537393505;6586.8353291168105;6598.8350291243105;7169.283071692893;7169.318914703095;7184.317489838457;7189.92810071903;7191.3887319578425;6350.396712312323;6488.28628850826;6539.738410463528;6560.212774467094;6581.835454113685;3804.9429258561145;3823.4264860270628;3823.8279277432025;3828.636279553438;3829.21501092281;7520.511166774142;7520.962395187989;7524.322810947041;7535.54786712799;7535.886961695579;6017.976943919544;7168.820779480555;7379.1513975892385;7387.113546374362;7397.371223446067;7518.398528117737;7524.209957954336;7527;7548.245175482408;7554.131274903457;6964.756233531802;7091.219965803654;7145;7247.347738703331;7253.528520646141;5806.506446952057;7137.750178743719;7166.964165179141;7170.247124052108;7187.928120718935;7327.560346379234;7562.2437756223935;7611.200823913631;7633.084029916446;7633.770986870402;3957.8416863325147;4163.916721665611;4622.121796858586;4802;4806.279058141167;6322.988321868663;7242.3843973262865;7245.963770181326;7250.927490725026;7257;6570.868582628416;6706.295838936841;6923.9960205770885;6971.755988540377;6982.755603553851;6962.443004559522;6965.059716938351;6967.372936435745;6981.581105133709;7068.187158476841;6803.25164231944;6809.148856392951;6815.011823285695;6817.863642727217;6831.11195544576;6810.62541560219;6919.37725604698;6969.094017777859;7003.404710599656;7007.754728584475;6826;6857.2114206866845;6871.347222013901;6872;6880.208775990625 11:17:16 INFO - PROCESS | 1682 | |5;yui.html;643.3823529411765;649.7530938243467;658.6015460646312;660.1418156396683;706.1349846438114;14732.410703571857;14907.403703851833;14930.850691493082;14943.327550260237;14987.925060374697;13284.933575332134;13440.731185376286;13609.863901360983;13621.931890340558;13625.318734063307;696.735240608568;712.1347562711305;856.4475913036104;858.171864151094;876.97807554811;858.1761508951383;872.2934423117296;878.6485405837652;878.8901387326584;881;915.9816803663923;916.3127654259306;916.5783739479847;918.4948278446861;920.9217216536603;730.0983285642228;744.1739668967442;744.8770952792783;745.6756311004731;746.3805041815281;656.8062421585644;675.4731309578488;677.3632785181914;678.348785166241;678.8540463800307;14224.85775142256;14277.286135693277;14294.356753946098;14319.997600167992;14360.138391696531;12028.819567706492;12245.08161887862;12371.443285052104;12832;13068.215907045607;10971.451427428598;11092.223544351898;11255.437228138642;11257.268277561932;11379.601713939972;3446.190145315849;3455.153487395579;3469.809160496172;3476.600190978045;3477.687008169277;78411.21588784097;78977;80336;80604;80683;9565.856512152322;9704.320697551244;9726.221902247944;9747.512624368754;10054.69835904924;19912.402627921187;20125.39623811288;20131;20143.899280503505;20156.891370974736;6450.258220304725;7464.552126872405;7470.178280389153;7689.19263477338;7997.640106195236;4050.696197785178;4122.793860307032;4219.3249080147025;4229.661627069827;4229.978850105791;3465.3935561276676;3502.7022703070015;3506.4915587239707;3507.2459421224557;3514.982425087909;628.1112226199876;644.0789670770843;646.3697894552868;647.4981889036035;657.1883723601348;533.0405270513061;555.419586532075;556.1507985946663;596.9820905372845;618.264265524025;8048.678052877936;8454.492730436194;8761.342899282452;8800;8860.778480538038;496.21350159996086;575.6085861614059;582.8921649494857;592.8428966323928;595.2440400691185;3645.927081458356;3839.232153569297;3856.267309211241;3869.1294458746556;3934.1934903344745;87041;87133.12866871378;88481;88782;88810;72835.63582182056;72856;73138.63430682813;73402;74010;56594;57968.71015644895;58323.70838145782;58398.70800646055;59021.70489147527;7647.082350117799;7676.462647614613;7918.287354138155;7953.085395179397;7978.680852765824;44276;44346;45325.320120198885;46452.767736161106;47198.764006181125;65666.34333656602;65722.34277657162;66244;67179;67223;10996.890031099907;11058.281211721212;11228.66314010581;11402;11618.5352585899;11969.401529923294;11979.161458697807;11983.820242696542;12075.75848483043;12366.443510042249;11376.829347559958;11385.203035787747;11389.772204555697;11395.886041139482;11410.600628977945;10813.945930270298;11163.832542511705;11369.943150284527;11454.370009649216;11509.769804604028;11185.496652650487;11192.888071119185;11194.048505877092;11266.324020558794;11266.436678165896;7607.923920760722;9227.492487913229;9441.339106262496;9711.077447642463;9870;9717.368371055858;9748.561314740711;9761.609535618496;9763.560639771085;9801.97079306691 11:17:16 INFO - PROCESS | 1682 | __end_tp_report 11:17:16 INFO - PROCESS | 1682 | __start_cc_report 11:17:16 INFO - PROCESS | 1682 | _x_x_mozilla_cycle_collect,2268 11:17:16 INFO - PROCESS | 1682 | __end_cc_report 11:17:16 INFO - PROCESS | 1682 | __startTimestamp1454872636825__endTimestamp 11:17:16 INFO - PROCESS | 1682 | 11:17:16 INFO - PROCESS | 1682 | ------- Summary: start ------- 11:17:16 INFO - PROCESS | 1682 | Number of tests: 6 11:17:16 INFO - PROCESS | 1682 | 11:17:16 INFO - PROCESS | 1682 | [#0] dojo.html Cycles:165 Average:5654.75 Median:5791.00 stddev:637.43 (11.0%) stddev-sans-first:615.03 11:17:16 INFO - PROCESS | 1682 | Values: 3430.1 3462.6 3489.4 3506.2 3527.2 4586.8 4901.5 5434.5 5634.7 5661.9 5635.5 5659.9 5665.0 5782.5 5796.3 5051.8 5104.3 5133.6 5135.6 5308.2 4415.7 5273.0 5288.6 5319.7 5348.9 5117.9 5132.5 5202.5 5218.1 5232.1 5132.9 5178.5 5179.8 5181.0 5189.9 5124.3 5147.2 5180.2 5185.1 5191.7 5465.3 5532.5 5564.7 5570.9 5634.7 6156.0 6181.5 6185.4 6193.5 6194.8 5308.7 5792.6 6212.7 6216.3 6249.3 5613.3 5630.9 5647.8 5660.7 5665.5 6258.4 6276.7 6286.6 6338.1 6380.4 6027.4 6073.5 6083.8 6099.9 6118.5 6210.6 6237.8 6262.4 6267.8 6267.9 6000.6 6128.7 6143.5 6168.0 6169.6 6167.6 6184.5 6196.8 6197.9 6202.5 4785.2 4806.9 4862.1 4876.7 4906.3 4292.4 4345.8 4363.6 4371.2 4418.3 5652.7 5664.5 5677.0 5697.6 5719.4 6125.9 6156.0 6254.1 6256.6 6266.2 5605.1 5627.8 5631.5 5639.0 5647.0 4726.7 5260.6 5283.0 5310.1 5314.5 6171.2 6315.8 6320.0 6328.5 6336.3 6155.2 6206.4 6209.8 6210.1 6238.3 6247.5 6248.5 6321.9 6327.0 6359.4 6107.4 6122.6 6122.9 6133.0 6147.9 6138.0 6207.3 6214.0 6224.4 6226.6 5824.8 5932.3 5934.9 5941.0 5949.0 5303.7 5633.5 5903.5 5917.2 5931.2 5423.9 5759.8 5779.7 5786.7 5791.0 5305.9 5847.8 5870.8 5945.9 6039.7 5877.8 5884.7 5893.3 5898.5 5900.3 11:17:16 INFO - PROCESS | 1682 | 11:17:16 INFO - PROCESS | 1682 | [#1] ext.html Cycles:180 Average:65051.37 Median:38611.82 stddev:137671.60 (356.6%) stddev-sans-first:137972.31 11:17:16 INFO - PROCESS | 1682 | Values: 430.1 481.6 483.7 579.9 615.9 30088.0 37954.9 38557.4 38666.2 38704.2 41525.6 41688.6 41787.2 41828.0 42079.8 9448.3 9629.6 9692.2 9695.2 9706.5 9593.3 9727.1 9742.6 9776.3 9870.8 9801.0 9897.3 9899.4 9899.5 9914.8 9778.2 9863.0 9865.6 9877.9 9880.7 9633.9 9714.3 9769.0 9769.2 9770.4 39834.6 40224.0 40233.0 40276.6 40320.4 3032.4 3133.0 3163.9 3218.5 3466.7 28089.7 29077.3 29543.6 29558.4 29813.0 2669.6 2760.8 2785.9 2795.6 2817.8 485270.0 486412.0 487270.0 488460.0 489933.0 55790.0 56651.6 56837.7 56898.4 57034.9 68105.0 70165.6 70210.0 70261.9 70309.6 15573.4 16061.1 16065.3 16069.9 16088.5 11231.6 11590.5 12226.6 12320.3 12359.8 19569.1 19796.6 19858.6 19860.8 20266.9 8702.5 8834.5 8884.3 8907.7 8909.2 930.2 948.3 1006.4 1065.6 1080.9 23927.9 25383.4 29247.4 29498.6 29757.7 1083.8 1092.3 1128.9 1139.7 1156.7 12592.9 15145.1 15178.8 15195.5 15208.1 537914.0 543885.0 544009.0 544729.0 547751.0 57528.7 58161.0 58210.7 58238.0 58294.0 1188.9 1205.9 1317.6 1375.3 1444.0 28660.6 28774.4 28812.0 29265.7 29365.1 45364.8 45832.8 45920.8 45935.0 46006.0 456112.0 525099.0 532943.0 533526.0 534627.0 28561.0 28720.3 28923.7 28955.9 29016.6 39677.8 40211.8 40315.8 40385.0 40558.4 31907.4 34567.5 34860.8 35088.3 35274.3 34679.1 35332.5 35604.0 35695.8 35726.3 35542.0 35768.0 35824.5 35960.1 37154.4 29634.0 30716.2 30831.4 30859.2 30950.7 23658.9 23726.2 23757.5 24092.6 24155.8 11:17:16 INFO - PROCESS | 1682 | 11:17:16 INFO - PROCESS | 1682 | [#2] jquery.html Cycles:180 Average:33975.45 Median:14357.88 stddev:101547.87 (707.3%) stddev-sans-first:101801.35 11:17:16 INFO - PROCESS | 1682 | Values: 350.3 358.3 362.3 369.2 370.2 14135.6 15239.3 18593.7 19348.2 19872.2 19524.9 19765.8 20218.8 20288.7 20323.7 6264.9 6439.3 6467.4 6490.3 6499.4 4574.8 4785.9 6354.0 6401.8 7256.1 7033.2 7046.3 7232.2 7246.3 7267.3 7101.9 7142.0 7214.9 7242.7 7282.6 6914.8 6979.3 6990.2 6995.1 7003.9 24903.4 25119.0 25514.6 25670.2 26086.1 2342.7 2422.3 2446.5 2497.5 2629.7 14615.5 14663.6 14891.9 15517.9 15520.3 1824.6 1833.8 1862.3 1881.2 1934.1 100810.0 101818.5 102643.5 103601.0 110891.7 9455.8 9811.4 10184.6 10933.6 11238.3 13518.2 13571.7 13577.5 13590.6 13610.9 8226.3 8340.6 8368.6 8406.2 8438.6 8394.2 8411.5 8428.3 8475.7 8514.7 4054.4 4201.9 4386.9 4459.8 4499.7 1736.7 1758.0 1806.5 1811.6 1816.8 874.9 913.4 995.4 1000.8 1018.3 15981.8 18758.6 19445.7 19719.9 19793.7 914.3 920.8 937.6 946.4 947.7 8874.0 10485.6 10683.3 10697.6 10809.8 575661.0 576190.4 582862.0 657582.0 667654.0 95428.0 118016.4 122160.2 122537.4 125861.1 1013.2 1188.0 1197.2 1214.5 1233.7 15129.8 17547.8 18313.8 18413.0 18685.4 46546.0 46719.8 47456.8 47780.8 48265.0 61820.1 62002.0 62229.4 63117.4 63913.7 7449.5 7565.4 7585.5 7673.2 7728.3 9592.0 11880.3 11942.8 12013.8 12194.4 10397.3 10517.9 10614.8 10665.0 10712.2 8667.7 9906.8 10338.7 10410.5 10476.2 9038.6 9822.0 10551.3 10644.3 10810.9 7495.9 7610.8 7612.0 7622.1 7641.3 8456.6 10427.8 10495.3 10542.9 10698.5 11:17:16 INFO - PROCESS | 1682 | 11:17:16 INFO - PROCESS | 1682 | [#3] mootools.html Cycles:180 Average:5918.85 Median:5345.36 stddev:3125.31 (58.5%) stddev-sans-first:3115.23 11:17:16 INFO - PROCESS | 1682 | Values: 1352.3 1449.3 1475.8 1628.3 1669.8 7743.5 8333.2 8487.2 8515.4 8525.3 8256.3 8511.3 8519.1 8521.2 8530.1 1977.9 2107.7 2166.7 2168.5 2384.0 2350.0 2417.0 2417.0 2417.5 2420.1 2332.6 2344.5 2379.5 2386.3 2388.2 2348.8 2350.9 2360.6 2391.8 2396.4 2366.0 2392.4 2402.9 2404.0 2405.3 8576.2 8591.3 8592.5 8607.9 8624.6 5165.5 5269.8 5277.2 5293.4 5312.5 3408.4 3490.0 3518.3 3530.4 3534.5 1032.0 1039.5 1051.3 1061.7 1070.2 11775.9 11802.1 11821.8 11825.2 11831.9 4725.1 4731.8 4791.7 4794.0 4805.3 9959.0 9965.9 9968.9 9983.0 9983.5 5295.7 5322.5 5342.2 5348.5 5349.4 4815.1 4877.7 4882.1 4882.6 4888.0 3604.0 3678.3 3686.1 3695.5 3882.2 1197.4 1254.2 1277.5 1295.1 1298.0 1297.5 1311.1 1341.0 1342.3 1342.5 7903.6 7909.5 8224.4 8233.7 8263.0 993.6 1156.5 1162.8 1165.8 1195.2 5440.7 6249.7 6257.7 6269.4 6272.9 9888.3 10452.8 10539.1 10557.9 10609.9 10356.8 10504.0 10548.6 10578.2 10591.0 8011.5 8181.1 8192.7 8202.0 8206.1 7510.3 7701.3 7746.6 7747.8 7774.1 7905.5 8068.9 9234.0 9512.2 9607.4 9647.8 9775.6 9797.9 9841.6 9846.5 7258.5 7368.7 7370.3 7376.2 7384.5 7090.1 7834.0 7930.7 7943.0 7956.4 7006.7 7163.6 7355.9 7519.7 7535.4 7155.7 7241.2 7312.5 7365.2 7393.0 7397.9 7431.7 7436.0 7446.0 7470.9 6715.5 6745.2 6748.6 6769.0 6787.8 6871.8 6920.6 6932.3 7003.8 7005.4 11:17:16 INFO - PROCESS | 1682 | 11:17:16 INFO - PROCESS | 1682 | [#4] prototype.html Cycles:180 Average:5711.09 Median:6482.29 stddev:1810.17 (27.9%) stddev-sans-first:1769.39 11:17:16 INFO - PROCESS | 1682 | Values: 316.8 325.1 329.9 330.5 335.0 6374.7 6452.4 6456.6 6476.3 6568.6 6267.8 6452.4 6498.9 6501.7 6522.5 4893.4 4893.4 4900.2 4902.6 4907.3 3956.0 4622.0 4737.8 4748.9 4857.7 4742.0 4785.1 4790.9 4808.0 4825.8 4822.2 4843.7 4848.4 4857.4 4864.8 4165.8 4166.5 4169.0 4172.7 4176.1 4873.3 6299.1 6333.1 6379.6 6397.6 5671.3 5681.1 5692.4 5711.6 5743.8 6230.3 6626.2 6988.9 6999.5 7029.3 4576.9 4649.8 4658.1 4659.3 4665.4 7223.8 7349.7 7363.7 7370.9 7400.3 4211.4 4739.5 4742.9 4749.8 4762.5 4379.4 4838.2 4844.3 4845.3 4850.0 5657.0 5666.6 5681.1 5686.9 5705.1 6990.7 7011.9 7018.2 7019.3 7024.1 1391.5 1621.5 1648.2 1674.1 1683.3 1079.1 1088.3 1088.8 1100.3 1100.5 6550.8 6553.4 6566.3 6586.8 6598.8 7169.3 7169.3 7184.3 7189.9 7191.4 6350.4 6488.3 6539.7 6560.2 6581.8 3804.9 3823.4 3823.8 3828.6 3829.2 7520.5 7521.0 7524.3 7535.5 7535.9 6018.0 7168.8 7379.2 7387.1 7397.4 7518.4 7524.2 7527.0 7548.2 7554.1 6964.8 7091.2 7145.0 7247.3 7253.5 5806.5 7137.8 7167.0 7170.2 7187.9 7327.6 7562.2 7611.2 7633.1 7633.8 3957.8 4163.9 4622.1 4802.0 4806.3 6323.0 7242.4 7246.0 7250.9 7257.0 6570.9 6706.3 6924.0 6971.8 6982.8 6962.4 6965.1 6967.4 6981.6 7068.2 6803.3 6809.1 6815.0 6817.9 6831.1 6810.6 6919.4 6969.1 7003.4 7007.8 6826.0 6857.2 6871.3 6872.0 6880.2 11:17:16 INFO - PROCESS | 1682 | 11:17:16 INFO - PROCESS | 1682 | [#5] yui.html Cycles:180 Average:17465.26 Median:58710.21 stddev:24126.76 (41.1%) stddev-sans-first:24161.38 11:17:16 INFO - PROCESS | 1682 | Values: 643.4 649.8 658.6 660.1 706.1 14732.4 14907.4 14930.9 14943.3 14987.9 13284.9 13440.7 13609.9 13621.9 13625.3 696.7 712.1 856.4 858.2 877.0 858.2 872.3 878.6 878.9 881.0 916.0 916.3 916.6 918.5 920.9 730.1 744.2 744.9 745.7 746.4 656.8 675.5 677.4 678.3 678.9 14224.9 14277.3 14294.4 14320.0 14360.1 12028.8 12245.1 12371.4 12832.0 13068.2 10971.5 11092.2 11255.4 11257.3 11379.6 3446.2 3455.2 3469.8 3476.6 3477.7 78411.2 78977.0 80336.0 80604.0 80683.0 9565.9 9704.3 9726.2 9747.5 10054.7 19912.4 20125.4 20131.0 20143.9 20156.9 6450.3 7464.6 7470.2 7689.2 7997.6 4050.7 4122.8 4219.3 4229.7 4230.0 3465.4 3502.7 3506.5 3507.2 3515.0 628.1 644.1 646.4 647.5 657.2 533.0 555.4 556.2 597.0 618.3 8048.7 8454.5 8761.3 8800.0 8860.8 496.2 575.6 582.9 592.8 595.2 3645.9 3839.2 3856.3 3869.1 3934.2 87041.0 87133.1 88481.0 88782.0 88810.0 72835.6 72856.0 73138.6 73402.0 74010.0 56594.0 57968.7 58323.7 58398.7 59021.7 7647.1 7676.5 7918.3 7953.1 7978.7 44276.0 44346.0 45325.3 46452.8 47198.8 65666.3 65722.3 66244.0 67179.0 67223.0 10996.9 11058.3 11228.7 11402.0 11618.5 11969.4 11979.2 11983.8 12075.8 12366.4 11376.8 11385.2 11389.8 11395.9 11410.6 10813.9 11163.8 11369.9 11454.4 11509.8 11185.5 11192.9 11194.0 11266.3 11266.4 7607.9 9227.5 9441.3 9711.1 9870.0 9717.4 9748.6 9761.6 9763.6 9802.0 11:17:16 INFO - PROCESS | 1682 | -------- Summary: end -------- 11:17:16 INFO - PROCESS | 1682 | 11:17:17 INFO - TEST-INFO | 1682: exit 0 11:17:17 INFO - TEST-OK | dromaeo_css | took 1114091ms 11:17:17 INFO - TEST-START | kraken 11:17:17 INFO - operating with platform_type : mac_ 11:17:17 INFO - Initialising browser for kraken test... 11:17:17 INFO - TEST-INFO | started process 1689 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/tmpPPthVZ/profile http://localhost:49285/getInfo.html) 11:17:19 INFO - PROCESS | 1689 | __metrics Screen width/height:1600/1200 11:17:19 INFO - PROCESS | 1689 | colorDepth:24 11:17:19 INFO - PROCESS | 1689 | Browser inner width/height: 1024/689 11:17:19 INFO - PROCESS | 1689 | __metrics 11:17:19 INFO - PROCESS | 1689 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 668: Error: Phase "quit-application-granted is finished, it is too late to register completion condition "SessionStore: flushing all windows" 11:17:19 INFO - PROCESS | 1689 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:17:20 INFO - TEST-INFO | 1689: exit 0 11:17:20 INFO - Browser initialized. 11:17:20 INFO - Running cycle 1/1 for kraken test... 11:17:20 INFO - TEST-INFO | started process 1691 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/T/tmpPPthVZ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:17:32 INFO - PROCESS | 1691 | RSS: Main: 245547008 11:17:32 INFO - PROCESS | 1691 | 11:17:34 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49285/tests/kraken/driver.html?testName=audio-beat-detection) 11:17:35 INFO - PROCESS | 1691 | RSS: Main: 294182912 11:17:35 INFO - PROCESS | 1691 | 11:17:38 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49285/tests/kraken/driver.html?testName=audio-dft) 11:17:38 INFO - PROCESS | 1691 | RSS: Main: 304074752 11:17:38 INFO - PROCESS | 1691 | 11:17:41 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49285/tests/kraken/driver.html?testName=audio-fft) 11:17:42 INFO - PROCESS | 1691 | RSS: Main: 287924224 11:17:42 INFO - PROCESS | 1691 | 11:17:44 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49285/tests/kraken/driver.html?testName=audio-oscillator) 11:17:44 INFO - PROCESS | 1691 | RSS: Main: 287686656 11:17:44 INFO - PROCESS | 1691 | 11:17:47 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49285/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:17:47 INFO - PROCESS | 1691 | RSS: Main: 289775616 11:17:47 INFO - PROCESS | 1691 | 11:17:50 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49285/tests/kraken/driver.html?testName=imaging-darkroom) 11:17:51 INFO - PROCESS | 1691 | RSS: Main: 289673216 11:17:51 INFO - PROCESS | 1691 | 11:17:53 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49285/tests/kraken/driver.html?testName=imaging-desaturate) 11:17:54 INFO - PROCESS | 1691 | RSS: Main: 291201024 11:17:54 INFO - PROCESS | 1691 | 11:17:57 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49285/tests/kraken/driver.html?testName=json-parse-financial) 11:17:57 INFO - PROCESS | 1691 | RSS: Main: 291336192 11:17:57 INFO - PROCESS | 1691 | 11:17:59 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49285/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:17:59 INFO - PROCESS | 1691 | RSS: Main: 326680576 11:17:59 INFO - PROCESS | 1691 | 11:18:01 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49285/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:18:02 INFO - PROCESS | 1691 | RSS: Main: 325873664 11:18:02 INFO - PROCESS | 1691 | 11:18:04 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49285/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:18:04 INFO - PROCESS | 1691 | RSS: Main: 334544896 11:18:04 INFO - PROCESS | 1691 | 11:18:07 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49285/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:18:08 INFO - PROCESS | 1691 | RSS: Main: 336850944 11:18:08 INFO - PROCESS | 1691 | 11:18:10 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49285/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:18:11 INFO - PROCESS | 1691 | RSS: Main: 336343040 11:18:11 INFO - PROCESS | 1691 | 11:18:12 INFO - PROCESS | 1691 | Cycle 1(1): loaded http://localhost:49285/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49285/tests/kraken/driver.html?testName=ai-astar) 11:18:13 INFO - PROCESS | 1691 | RSS: Main: 396496896 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | __start_tp_report 11:18:13 INFO - PROCESS | 1691 | _x_x_mozilla_page_load 11:18:13 INFO - PROCESS | 1691 | _x_x_mozilla_page_load_details 11:18:13 INFO - PROCESS | 1691 | |i|pagename|runs| 11:18:13 INFO - PROCESS | 1691 | |0;ai-astar;110;109;111;111;111;112;115;111;111;111 11:18:13 INFO - PROCESS | 1691 | |1;audio-beat-detection;156;125;149;186;145;143;139;119;157;119 11:18:13 INFO - PROCESS | 1691 | |2;audio-dft;185;185;186;187;184;184;187;186;180;181 11:18:13 INFO - PROCESS | 1691 | |3;audio-fft;76;76;84;78;58;58;60;79;75;55 11:18:13 INFO - PROCESS | 1691 | |4;audio-oscillator;95;94;122;79;80;89;111;80;110;138 11:18:13 INFO - PROCESS | 1691 | |5;imaging-gaussian-blur;88;90;84;90;85;108;111;91;85;91 11:18:13 INFO - PROCESS | 1691 | |6;imaging-darkroom;94;94;94;94;94;95;93;92;93;93 11:18:13 INFO - PROCESS | 1691 | |7;imaging-desaturate;87;88;87;84;85;97;143;84;85;85 11:18:13 INFO - PROCESS | 1691 | |8;json-parse-financial;54;56;55;55;55;54;54;65;52;52 11:18:13 INFO - PROCESS | 1691 | |9;json-stringify-tinderbox;64;65;81;75;70;67;67;67;66;68 11:18:13 INFO - PROCESS | 1691 | |10;stanford-crypto-aes;84;83;83;83;80;83;82;83;84;85 11:18:13 INFO - PROCESS | 1691 | |11;stanford-crypto-ccm;132;126;125;125;120;125;123;122;122;121 11:18:13 INFO - PROCESS | 1691 | |12;stanford-crypto-pbkdf2;136;126;145;177;173;130;137;139;136;171 11:18:13 INFO - PROCESS | 1691 | |13;stanford-crypto-sha256-iterative;67;66;67;67;67;67;66;69;68;66 11:18:13 INFO - PROCESS | 1691 | __end_tp_report 11:18:13 INFO - PROCESS | 1691 | __start_cc_report 11:18:13 INFO - PROCESS | 1691 | _x_x_mozilla_cycle_collect,1162 11:18:13 INFO - PROCESS | 1691 | __end_cc_report 11:18:13 INFO - PROCESS | 1691 | __startTimestamp1454872693234__endTimestamp 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | ------- Summary: start ------- 11:18:13 INFO - PROCESS | 1691 | Number of tests: 14 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#0] ai-astar Cycles:10 Average:111.20 Median:111.00 stddev:1.55 (1.4%) stddev-sans-first:1.58 11:18:13 INFO - PROCESS | 1691 | Values: 110.0 109.0 111.0 111.0 111.0 112.0 115.0 111.0 111.0 111.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#1] audio-beat-detection Cycles:10 Average:143.80 Median:147.00 stddev:20.38 (13.9%) stddev-sans-first:21.14 11:18:13 INFO - PROCESS | 1691 | Values: 156.0 125.0 149.0 186.0 145.0 143.0 139.0 119.0 157.0 119.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#2] audio-dft Cycles:10 Average:184.50 Median:185.50 stddev:2.37 (1.3%) stddev-sans-first:2.51 11:18:13 INFO - PROCESS | 1691 | Values: 185.0 185.0 186.0 187.0 184.0 184.0 187.0 186.0 180.0 181.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#3] audio-fft Cycles:10 Average:69.90 Median:76.00 stddev:10.81 (14.2%) stddev-sans-first:11.23 11:18:13 INFO - PROCESS | 1691 | Values: 76.0 76.0 84.0 78.0 58.0 58.0 60.0 79.0 75.0 55.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#4] audio-oscillator Cycles:10 Average:99.80 Median:80.00 stddev:19.92 (24.9%) stddev-sans-first:21.05 11:18:13 INFO - PROCESS | 1691 | Values: 95.0 94.0 122.0 79.0 80.0 89.0 111.0 80.0 110.0 138.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#5] imaging-gaussian-blur Cycles:10 Average:92.30 Median:89.00 stddev:9.45 (10.6%) stddev-sans-first:9.90 11:18:13 INFO - PROCESS | 1691 | Values: 88.0 90.0 84.0 90.0 85.0 108.0 111.0 91.0 85.0 91.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#6] imaging-darkroom Cycles:10 Average:93.60 Median:94.00 stddev:0.84 (0.9%) stddev-sans-first:0.88 11:18:13 INFO - PROCESS | 1691 | Values: 94.0 94.0 94.0 94.0 94.0 95.0 93.0 92.0 93.0 93.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#7] imaging-desaturate Cycles:10 Average:92.50 Median:86.00 stddev:18.15 (21.1%) stddev-sans-first:19.14 11:18:13 INFO - PROCESS | 1691 | Values: 87.0 88.0 87.0 84.0 85.0 97.0 143.0 84.0 85.0 85.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#8] json-parse-financial Cycles:10 Average:55.20 Median:55.00 stddev:3.68 (6.7%) stddev-sans-first:3.87 11:18:13 INFO - PROCESS | 1691 | Values: 54.0 56.0 55.0 55.0 55.0 54.0 54.0 65.0 52.0 52.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#9] json-stringify-tinderbox Cycles:10 Average:69.00 Median:67.50 stddev:5.21 (7.7%) stddev-sans-first:5.20 11:18:13 INFO - PROCESS | 1691 | Values: 64.0 65.0 81.0 75.0 70.0 67.0 67.0 67.0 66.0 68.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#10] stanford-crypto-aes Cycles:10 Average:83.00 Median:83.00 stddev:1.33 (1.6%) stddev-sans-first:1.36 11:18:13 INFO - PROCESS | 1691 | Values: 84.0 83.0 83.0 83.0 80.0 83.0 82.0 83.0 84.0 85.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#11] stanford-crypto-ccm Cycles:10 Average:124.10 Median:125.00 stddev:3.41 (2.7%) stddev-sans-first:2.11 11:18:13 INFO - PROCESS | 1691 | Values: 132.0 126.0 125.0 125.0 120.0 125.0 123.0 122.0 122.0 121.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:147.00 Median:142.00 stddev:19.13 (13.5%) stddev-sans-first:19.87 11:18:13 INFO - PROCESS | 1691 | Values: 136.0 126.0 145.0 177.0 173.0 130.0 137.0 139.0 136.0 171.0 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - PROCESS | 1691 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.00 Median:67.00 stddev:0.94 (1.4%) stddev-sans-first:1.00 11:18:13 INFO - PROCESS | 1691 | Values: 67.0 66.0 67.0 67.0 67.0 67.0 66.0 69.0 68.0 66.0 11:18:13 INFO - PROCESS | 1691 | -------- Summary: end -------- 11:18:13 INFO - PROCESS | 1691 | 11:18:13 INFO - TEST-INFO | 1691: exit 0 11:18:13 INFO - TEST-OK | kraken | took 56593ms 11:18:13 INFO - SUITE-END | took 1170s 11:18:14 INFO - Completed test suite (00:19:31) 11:18:14 INFO - Working with test: dromaeo_css 11:18:14 INFO - Generating results file: dromaeo_css 11:18:14 INFO - Working with test: kraken 11:18:14 INFO - Generating results file: kraken 11:18:14 INFO - javascript benchmark 11:18:14 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:18:14 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,64,59]] 11:18:14 INFO - process_Request line: dromaeo_css 7442.70 graph.html#tests=[[72,64,59]] 11:18:14 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:18:14 INFO - process_Request line: kraken 1432.90 graph.html#tests=[[232,64,59]] 11:18:14 INFO - RETURN: dromaeo_css: 7442.70 11:18:14 INFO - RETURN: kraken: 1432.90 11:18:14 INFO - javascript benchmark 11:18:14 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3430.0910258781423, 3462.636423175565, 3489.354469423156, 3506.1760486285702, 3527.2416430467442, 4586.793594288257, 4901.509849015101, 5434.510894019538, 5634.690092044936, 5661.924234395462, 5635.520980716644, 5659.943400565993, 5664.971675141629, 5782.479576838084, 5796.275465566804, 5051.772670229849, 5104.310918026074, 5133.563647090002, 5135.64050516464, 5308.23030660554, 4415.66882483815, 5273.0, 5288.550473209782, 5319.707416092114, 5348.866278343034, 5117.872053198663, 5132.5124113209185, 5202.479752024805, 5218.086834803932, 5232.084385232607, 5132.897342053138, 5178.533931946105, 5179.792808287664, 5180.974095129538, 5189.922151167735, 5124.308218390507, 5147.176451767737, 5180.171172612401, 5185.066687996159, 5191.740412979336, 5465.289512363367, 5532.529734972532, 5564.666120032771, 5570.888582228374, 5634.690092044936, 6156.0, 6181.474574661159, 6185.35053819347, 6193.5354848386105, 6194.783182588588, 5308.70802105884, 5792.565557583156, 6212.72042758077, 6216.254049514042, 6249.312575616678, 5613.326400831845, 5630.915536266959, 5647.802326918538, 5660.660360378391, 5665.461781130786, 6258.374162583706, 6276.717547710364, 6286.591371560834, 6338.080978258126, 6380.425761681471, 6027.36712645166, 6073.453389194994, 6083.787067452707, 6099.878002440015, 6118.479929205978, 6210.596311239755, 6237.750489980441, 6262.436380725757, 6267.7806276781, 6267.874642507124, 6000.579959402888, 6128.662923539159, 6143.477804386677, 6168.0, 6169.56813023093, 6167.629942203482, 6184.474319682878, 6196.752129914753, 6197.938020619736, 6202.534809889276, 4785.210440277316, 4806.903861922742, 4862.124817532878, 4876.683015603974, 4906.337644417958, 4292.420523229386, 4345.782710864444, 4363.563643635611, 4371.23503386906, 4418.33724941255, 5652.745626446737, 5664.461876121762, 5676.971615141898, 5697.601167918206, 5719.428057194247, 6125.877482450326, 6156.015037594053, 6254.093156492283, 6256.593321434092, 6266.216722909637, 5605.0751625982075, 5627.831165065055, 5631.465010823965, 5639.013172694762, 5646.971765141148, 4726.747411935839, 5260.631755777135, 5283.0, 5310.123829568155, 5314.468553144655, 6171.197744293213, 6315.842103947438, 6319.968400158062, 6328.462080723098, 6336.303006669263, 6155.230596175478, 6206.379362063757, 6209.813705588839, 6210.068489726577, 6238.282597501346, 6247.468965138014, 6248.531360148098, 6321.936780632319, 6326.9876819708625, 6359.427651511386, 6107.431569637723, 6122.611623597813, 6122.886318443891, 6133.028644417115, 6147.924113280247, 6137.966867168879, 6207.286162091417, 6214.0, 6224.37756224374, 6226.59527130735, 5824.767009319749, 5932.2584676915385, 5934.910976335272, 5940.970295148497, 5949.0, 5303.681779093266, 5633.549316054624, 5903.468687818117, 5917.230760001173, 5931.169636251015, 5423.915216956546, 5759.827205183851, 5779.682117483579, 5786.681732504584, 5791.0, 5305.9204111939125, 5847.771967886792, 5870.765169393177, 5945.851353716192, 6039.6678182698615, 5877.794277200277, 5884.735186916685, 5893.263342082239, 5898.469137777621, 5900.262467191601], "unit": "score", "name": "dojo.html", "value": 5615.782454234902}, {"lowerIsBetter": false, "replicates": [430.1289887976848, 481.5906479492431, 483.6602610768172, 579.904315787895, 615.9322474527801, 30088.0, 37954.86135415935, 38557.42163867544, 38666.226675466474, 38704.22591548167, 41525.58474415255, 41688.58311416893, 41787.164256714925, 41828.0, 42079.78960105203, 9448.34653935562, 9629.614815407374, 9692.176165025981, 9695.17591004762, 9706.466144362057, 9593.280503962196, 9727.07592778685, 9742.561584728704, 9776.266779991494, 9870.802583948316, 9801.0, 9897.257705672067, 9899.356541824758, 9899.50502474877, 9914.801703965917, 9778.217742580577, 9862.950685246527, 9865.60537578496, 9877.90122098777, 9880.65417710384, 9633.90366096344, 9714.31999760017, 9768.97425770291, 9769.218462522982, 9770.36492627984, 39834.60165398367, 40224.0, 40232.99417514556, 40276.59723402787, 40320.39519407211, 3032.3935212957276, 3132.9974408189387, 3163.9209019774457, 3218.452863013293, 3466.7053300469493, 28089.719102808915, 29077.273068173465, 29543.556846647316, 29558.408831823457, 29813.0, 2669.626252324676, 2760.7653349465318, 2785.902493412741, 2795.594638777366, 2817.8027538072342, 485270.0, 486412.0, 487270.0, 488460.0, 489933.0, 55790.0, 56651.58371040757, 56837.715811421505, 56898.43101569014, 57034.85930281371, 68105.0, 70165.64917175382, 70210.0, 70261.94607080898, 70309.64845175741, 15573.377064917277, 16061.11663858499, 16065.277062532214, 16069.919650401673, 16088.517344479684, 11231.606893758679, 11590.478428470738, 12226.633201003984, 12320.260784352968, 12359.75280494403, 19569.1193896275, 19796.60406791856, 19858.60282794336, 19860.801391986184, 20266.89866550658, 8702.47785132894, 8834.514101724339, 8884.333674974403, 8907.73276801697, 8909.198172164406, 930.181440332503, 948.3456415073715, 1006.4464544500496, 1065.648336049102, 1080.9189310801721, 23927.880360598432, 25383.36541586438, 29247.415051699274, 29498.55752163719, 29757.702422975926, 1083.815751322277, 1092.2736380307165, 1128.853249077631, 1139.7207684117445, 1156.7108222944264, 12592.874071259354, 15145.122426738884, 15178.848211517965, 15195.520734488135, 15208.08751474915, 537914.0, 543885.0, 544009.0, 544729.0, 547751.0, 57528.71235643879, 58161.0, 58210.70894645499, 58238.0, 58294.0, 1188.9464974076188, 1205.879412058787, 1317.5849607373646, 1375.2917247617486, 1444.0469290268372, 28660.57009144823, 28774.424511509234, 28812.0, 29265.707342926296, 29365.09126906744, 45364.77317613391, 45832.7708361456, 45920.770396147804, 45935.0, 46006.0, 456112.0, 525099.0, 532943.0, 533526.0, 534627.0, 28561.0, 28720.281992950342, 28923.710762892944, 28955.855220723763, 29016.56475152832, 39677.80161099176, 40211.8397998743, 40315.79842100888, 40385.0, 40558.39162412625, 31907.36185276235, 34567.481487778205, 34860.82569587136, 35088.29823403569, 35274.294514110086, 34679.13302167466, 35332.47001295034, 35604.01543783821, 35695.82152089223, 35726.28547429089, 35542.0, 35768.0, 35824.46263306, 35960.10099747423, 37154.442683360314, 29634.0, 30716.23209419693, 30831.383372332875, 30859.2285192863, 30950.690493094782, 23658.88170559136, 23726.169584064475, 23757.524849503257, 24092.638610421207, 24155.75844241535], "unit": "score", "name": "ext.html", "value": 19399.132242225463}, {"lowerIsBetter": false, "replicates": [350.2574541971021, 358.28343313373256, 362.3242652453174, 369.16016063455635, 370.20406126827334, 14135.575932722035, 15239.31423085961, 18593.7210941836, 19348.226070957164, 19872.205111795512, 19524.90237548814, 19765.81405115694, 20218.797812021876, 20288.69566956493, 20323.695144572805, 6264.906026409608, 6439.291677915449, 6467.353264673518, 6490.253620833594, 6499.382558656944, 4574.771261436931, 4785.880352991168, 6353.983362661975, 6401.8399540011405, 7256.092988376453, 7033.191183013968, 7046.295370462964, 7232.168300645414, 7246.311600397954, 7267.30960558746, 7101.89347159793, 7142.0, 7214.8557028859395, 7242.746503872392, 7282.599457029861, 6914.757983470605, 6979.336962988508, 6990.161180658302, 6995.09063821705, 7003.8599228015155, 24903.377415564573, 25119.0, 25514.617280740804, 25670.22989310324, 26086.087386743682, 2342.7188737351457, 2422.2975337152207, 2446.4862378900452, 2497.5254701606636, 2629.671291088614, 14615.488457904028, 14663.63340916475, 14891.851081489154, 15517.922410387988, 15520.301586428637, 1824.6350729854082, 1833.8074502177346, 1862.3109449503636, 1881.2192939929912, 1934.0813113770987, 100810.0, 101818.47272290921, 102643.46034809409, 103600.96399036064, 110891.68312376604, 9455.810883782286, 9811.362261452983, 10184.643537476153, 10933.617323393642, 11238.325700458, 13518.188908665512, 13571.728565428833, 13577.456901723821, 13590.59228223155, 13610.863891361158, 8226.341892648574, 8340.582970851434, 8368.58157092143, 8406.201410865959, 8438.620262088221, 8394.202550757669, 8411.495310281403, 8428.32573394127, 8475.74572762818, 8514.659413623509, 4054.432379466877, 4201.894952626209, 4386.890327741832, 4459.7547134907245, 4499.707519011254, 1736.6714463435483, 1757.9912100439417, 1806.5032116168159, 1811.5815386459224, 1816.845568126724, 874.8731433942042, 913.4382354851718, 995.4326034160459, 1000.7948370584159, 1018.3482571154467, 15981.840181598267, 18758.624827503372, 19445.708314375297, 19719.915404652882, 19793.703094453595, 914.2642055162981, 920.7513971227731, 937.5687183895484, 946.3753922411175, 947.7014740356904, 8874.010835008745, 10485.633002844865, 10683.25217234786, 10697.572097116185, 10809.783804324026, 575661.0, 576190.4287535799, 582862.0, 657582.0, 667654.0, 95428.0, 118016.40991794986, 122160.16759748434, 122537.38731306465, 125861.11208331882, 1013.1793247469574, 1187.9643610691694, 1197.1500234833366, 1214.4595654933646, 1233.6977440527128, 15129.773053403987, 17547.824521754617, 18313.816861831743, 18413.0, 18685.439436816916, 46546.0, 46719.76640116778, 47456.7627161862, 47780.7610961943, 48265.0, 61820.072698908654, 62002.0, 62229.37770622236, 63117.42206444692, 63913.72172556616, 7449.515781474187, 7565.356944659766, 7585.506942048749, 7673.232676732282, 7728.304452599293, 9591.952040239754, 11880.34658093813, 11942.820857687315, 12013.75972480563, 12194.390280486117, 10397.272190946864, 10517.9474102629, 10614.787704246026, 10665.0, 10712.19658525598, 8667.739967800977, 9906.752331191778, 10338.689839304832, 10410.479476026017, 10476.16190704757, 9038.593263303299, 9821.950890245504, 10551.261411701415, 10644.254902156774, 10810.945945270538, 7495.925040749523, 7610.771676849482, 7611.961940190264, 7622.123455802654, 7641.312281894656, 8456.577171141294, 10427.791444171226, 10495.317804342692, 10542.947285263524, 10698.465076745975], "unit": "score", "name": "jquery.html", "value": 9453.43224048259}, {"lowerIsBetter": false, "replicates": [1352.3170798746644, 1449.2753623188405, 1475.8376578576356, 1628.332383722674, 1669.7996240451141, 7743.457957942946, 8333.166683331672, 8487.151284871525, 8515.403921725474, 8525.275351595123, 8256.298214651762, 8511.319094472443, 8519.148085191493, 8521.233089021987, 8530.146985301466, 1977.9307724229618, 2107.7049213110176, 2166.7183266175375, 2168.5229249565073, 2383.9642405363934, 2349.9647505287435, 2416.9879150604224, 2417.033186725306, 2417.468157005456, 2420.092465325503, 2332.6384410416413, 2344.460774021976, 2379.4527258730504, 2386.2721869829693, 2388.2477019738812, 2348.8003519700674, 2350.8824558771994, 2360.6459031145378, 2391.8445301055376, 2396.3769419950763, 2365.988170059156, 2392.377981724747, 2402.903883844662, 2403.987980060106, 2405.314485371661, 8576.185262400062, 8591.26974207193, 8592.484450932901, 8607.870881936777, 8624.568771561397, 5165.457626949154, 5269.815556455505, 5277.1820367842665, 5293.444188360205, 5312.468753124656, 3408.352413041514, 3490.0402389343135, 3518.3315170117853, 3530.3645343838098, 3534.540509733744, 1031.9845202321972, 1039.4698703661188, 1051.3008849115329, 1061.6655753437642, 1070.1920050362005, 11775.882241177564, 11802.055835533136, 11821.822672659917, 11825.172237943347, 11831.881681183164, 4725.149473094807, 4731.79971313334, 4791.712497250106, 4793.952060479351, 4805.327254184417, 9959.0, 9965.850512242323, 9968.850467242997, 9983.003399320165, 9983.500824958723, 5295.708736019479, 5322.520973112439, 5342.2253773202665, 5348.491893270133, 5349.358077030781, 4815.061063092733, 4877.658563900563, 4882.145624515695, 4882.5605695487575, 4888.0, 3603.9728677326834, 3678.319510890494, 3686.1337585667347, 3695.519582454264, 3882.242962622318, 1197.3655959615062, 1254.2035807262455, 1277.5081593586535, 1295.080492850087, 1297.9740405191844, 1297.4939773488347, 1311.1346511302686, 1341.0478560222157, 1342.3355439057534, 1342.5032737887045, 7903.604819758989, 7909.52542847431, 8224.38317126206, 8233.670653173805, 8262.958685206535, 993.6323560282742, 1156.4622450560362, 1162.808136657459, 1165.830954511591, 1195.1872726545857, 5440.700761458079, 6249.6562689051625, 6257.7184026718, 6269.435750782452, 6272.937270627326, 9888.258380621483, 10452.843207351896, 10539.104176145114, 10557.894421055844, 10609.89390106089, 10356.844647330296, 10504.002119798606, 10548.578056877639, 10578.153747700166, 10590.993855583707, 8011.479253848481, 8181.100078991306, 8192.713255036046, 8202.015758109184, 8206.05630352517, 7510.286522780327, 7701.268379503938, 7746.57393843344, 7747.845043099219, 7774.144844067261, 7905.486143400661, 8068.87896681562, 9234.0, 9512.239020878174, 9607.375520591138, 9647.807043859224, 9775.560099795384, 9797.902020979698, 9841.60633574649, 9846.507674616098, 7258.455615828729, 7368.705251789868, 7370.336669699753, 7376.151742549676, 7384.52000619958, 7090.113735783028, 7834.0, 7930.722424715107, 7942.967414236113, 7956.403269754675, 7006.684699188447, 7163.6060016699585, 7355.889661654973, 7519.736809211651, 7535.397168226638, 7155.677994490365, 7241.239669834592, 7312.5246858954, 7365.1530074042175, 7393.0, 7397.889031664637, 7431.739889103856, 7435.9628201860805, 7445.9627701861145, 7470.887936680845, 6715.462762978852, 6745.156855393076, 6748.5613435128525, 6769.0, 6787.762428314985, 6871.759488417882, 6920.5847649141215, 6932.341427564374, 7003.824904377431, 7005.404540614105], "unit": "score", "name": "mootools.html", "value": 4823.688295545991}, {"lowerIsBetter": false, "replicates": [316.75768037451354, 325.14324754272485, 329.94555898276786, 330.52734589536954, 335.0467918771095, 6374.681265936708, 6452.4192822645955, 6456.612603243809, 6476.287608363076, 6568.573042752218, 6267.780627678032, 6452.4192822645955, 6498.902516462257, 6501.707423165957, 6522.543421960465, 4893.41279046515, 4893.437254715717, 4900.166971614834, 4902.583280421169, 4907.263910413449, 3956.030772460751, 4621.976890115561, 4737.834175803848, 4748.90502189956, 4857.708537487744, 4742.0, 4785.090832741768, 4790.856274311759, 4807.951920480803, 4825.806967721304, 4822.204336284544, 4843.733594652275, 4848.369711937443, 4857.441394239672, 4864.78108485119, 4165.770882601456, 4166.458360413127, 4169.0411205422615, 4172.749635021878, 4176.14389050244, 4873.31773551703, 6299.149614801989, 6333.113364129025, 6379.585326953733, 6397.5521713480075, 5671.270262569915, 5681.147827825818, 5692.402297758717, 5711.571632127607, 5743.827685169452, 6230.345813689588, 6626.204855417381, 6988.860222795566, 6999.475039372068, 7029.2619274975905, 4576.885577860547, 4649.767511624439, 4658.138244424758, 4659.254519276933, 4665.440147182359, 7223.819404514877, 7349.70601175947, 7363.705451781922, 7370.8894366584545, 7400.296971787618, 4211.431456753299, 4739.502352253033, 4742.857714268577, 4749.810007599657, 4762.476127625959, 4379.386885835986, 4838.225883858566, 4844.297576851337, 4845.273209018605, 4850.0, 5656.971715141481, 5666.631668941505, 5681.0910254359105, 5686.857828554319, 5705.087186050212, 6990.720371185095, 7011.89482157768, 7018.227994920555, 7019.262977387403, 7024.086868707138, 1391.54079153881, 1621.4649165775265, 1648.2006226979904, 1674.054159399935, 1683.318256106279, 1079.1312993040522, 1088.3089238333557, 1088.8149014667526, 1100.301308669001, 1100.5322737836389, 6550.803475895731, 6553.377429144223, 6566.310537393505, 6586.8353291168105, 6598.8350291243105, 7169.283071692893, 7169.318914703095, 7184.317489838457, 7189.92810071903, 7191.3887319578425, 6350.396712312323, 6488.28628850826, 6539.738410463528, 6560.212774467094, 6581.835454113685, 3804.9429258561145, 3823.4264860270628, 3823.8279277432025, 3828.636279553438, 3829.21501092281, 7520.511166774142, 7520.962395187989, 7524.322810947041, 7535.54786712799, 7535.886961695579, 6017.976943919544, 7168.820779480555, 7379.1513975892385, 7387.113546374362, 7397.371223446067, 7518.398528117737, 7524.209957954336, 7527.0, 7548.245175482408, 7554.131274903457, 6964.756233531802, 7091.219965803654, 7145.0, 7247.347738703331, 7253.528520646141, 5806.506446952057, 7137.750178743719, 7166.964165179141, 7170.247124052108, 7187.928120718935, 7327.560346379234, 7562.2437756223935, 7611.200823913631, 7633.084029916446, 7633.770986870402, 3957.8416863325147, 4163.916721665611, 4622.121796858586, 4802.0, 4806.279058141167, 6322.988321868663, 7242.3843973262865, 7245.963770181326, 7250.927490725026, 7257.0, 6570.868582628416, 6706.295838936841, 6923.9960205770885, 6971.755988540377, 6982.755603553851, 6962.443004559522, 6965.059716938351, 6967.372936435745, 6981.581105133709, 7068.187158476841, 6803.25164231944, 6809.148856392951, 6815.011823285695, 6817.863642727217, 6831.11195544576, 6810.62541560219, 6919.37725604698, 6969.094017777859, 7003.404710599656, 7007.754728584475, 6826.0, 6857.2114206866845, 6871.347222013901, 6872.0, 6880.208775990625], "unit": "score", "name": "prototype.html", "value": 5107.260628450995}, {"lowerIsBetter": false, "replicates": [643.3823529411765, 649.7530938243467, 658.6015460646312, 660.1418156396683, 706.1349846438114, 14732.410703571857, 14907.403703851833, 14930.850691493082, 14943.327550260237, 14987.925060374697, 13284.933575332134, 13440.731185376286, 13609.863901360983, 13621.931890340558, 13625.318734063307, 696.735240608568, 712.1347562711305, 856.4475913036104, 858.171864151094, 876.97807554811, 858.1761508951383, 872.2934423117296, 878.6485405837652, 878.8901387326584, 881.0, 915.9816803663923, 916.3127654259306, 916.5783739479847, 918.4948278446861, 920.9217216536603, 730.0983285642228, 744.1739668967442, 744.8770952792783, 745.6756311004731, 746.3805041815281, 656.8062421585644, 675.4731309578488, 677.3632785181914, 678.348785166241, 678.8540463800307, 14224.85775142256, 14277.286135693277, 14294.356753946098, 14319.997600167992, 14360.138391696531, 12028.819567706492, 12245.08161887862, 12371.443285052104, 12832.0, 13068.215907045607, 10971.451427428598, 11092.223544351898, 11255.437228138642, 11257.268277561932, 11379.601713939972, 3446.190145315849, 3455.153487395579, 3469.809160496172, 3476.600190978045, 3477.687008169277, 78411.21588784097, 78977.0, 80336.0, 80604.0, 80683.0, 9565.856512152322, 9704.320697551244, 9726.221902247944, 9747.512624368754, 10054.69835904924, 19912.402627921187, 20125.39623811288, 20131.0, 20143.899280503505, 20156.891370974736, 6450.258220304725, 7464.552126872405, 7470.178280389153, 7689.19263477338, 7997.640106195236, 4050.696197785178, 4122.793860307032, 4219.3249080147025, 4229.661627069827, 4229.978850105791, 3465.3935561276676, 3502.7022703070015, 3506.4915587239707, 3507.2459421224557, 3514.982425087909, 628.1112226199876, 644.0789670770843, 646.3697894552868, 647.4981889036035, 657.1883723601348, 533.0405270513061, 555.419586532075, 556.1507985946663, 596.9820905372845, 618.264265524025, 8048.678052877936, 8454.492730436194, 8761.342899282452, 8800.0, 8860.778480538038, 496.21350159996086, 575.6085861614059, 582.8921649494857, 592.8428966323928, 595.2440400691185, 3645.927081458356, 3839.232153569297, 3856.267309211241, 3869.1294458746556, 3934.1934903344745, 87041.0, 87133.12866871378, 88481.0, 88782.0, 88810.0, 72835.63582182056, 72856.0, 73138.63430682813, 73402.0, 74010.0, 56594.0, 57968.71015644895, 58323.70838145782, 58398.70800646055, 59021.70489147527, 7647.082350117799, 7676.462647614613, 7918.287354138155, 7953.085395179397, 7978.680852765824, 44276.0, 44346.0, 45325.320120198885, 46452.767736161106, 47198.764006181125, 65666.34333656602, 65722.34277657162, 66244.0, 67179.0, 67223.0, 10996.890031099907, 11058.281211721212, 11228.66314010581, 11402.0, 11618.5352585899, 11969.401529923294, 11979.161458697807, 11983.820242696542, 12075.75848483043, 12366.443510042249, 11376.829347559958, 11385.203035787747, 11389.772204555697, 11395.886041139482, 11410.600628977945, 10813.945930270298, 11163.832542511705, 11369.943150284527, 11454.370009649216, 11509.769804604028, 11185.496652650487, 11192.888071119185, 11194.048505877092, 11266.324020558794, 11266.436678165896, 7607.923920760722, 9227.492487913229, 9441.339106262496, 9711.077447642463, 9870.0, 9717.368371055858, 9748.561314740711, 9761.609535618496, 9763.560639771085, 9801.97079306691], "unit": "score", "name": "yui.html", "value": 6698.806793875508}], "name": "dromaeo_css", "value": 7442.697612299106}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 109.0, 111.0, 111.0, 111.0, 112.0, 115.0, 111.0, 111.0, 111.0], "unit": "score", "name": "ai-astar", "value": 111.2}, {"lowerIsBetter": true, "replicates": [156.0, 125.0, 149.0, 186.0, 145.0, 143.0, 139.0, 119.0, 157.0, 119.0], "unit": "score", "name": "audio-beat-detection", "value": 143.8}, {"lowerIsBetter": true, "replicates": [185.0, 185.0, 186.0, 187.0, 184.0, 184.0, 187.0, 186.0, 180.0, 181.0], "unit": "score", "name": "audio-dft", "value": 184.5}, {"lowerIsBetter": true, "replicates": [76.0, 76.0, 84.0, 78.0, 58.0, 58.0, 60.0, 79.0, 75.0, 55.0], "unit": "score", "name": "audio-fft", "value": 69.9}, {"lowerIsBetter": true, "replicates": [95.0, 94.0, 122.0, 79.0, 80.0, 89.0, 111.0, 80.0, 110.0, 138.0], "unit": "score", "name": "audio-oscillator", "value": 99.8}, {"lowerIsBetter": true, "replicates": [88.0, 90.0, 84.0, 90.0, 85.0, 108.0, 111.0, 91.0, 85.0, 91.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 92.3}, {"lowerIsBetter": true, "replicates": [94.0, 94.0, 94.0, 94.0, 94.0, 95.0, 93.0, 92.0, 93.0, 93.0], "unit": "score", "name": "imaging-darkroom", "value": 93.6}, {"lowerIsBetter": true, "replicates": [87.0, 88.0, 87.0, 84.0, 85.0, 97.0, 143.0, 84.0, 85.0, 85.0], "unit": "score", "name": "imaging-desaturate", "value": 92.5}, {"lowerIsBetter": true, "replicates": [54.0, 56.0, 55.0, 55.0, 55.0, 54.0, 54.0, 65.0, 52.0, 52.0], "unit": "score", "name": "json-parse-financial", "value": 55.2}, {"lowerIsBetter": true, "replicates": [64.0, 65.0, 81.0, 75.0, 70.0, 67.0, 67.0, 67.0, 66.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 69.0}, {"lowerIsBetter": true, "replicates": [84.0, 83.0, 83.0, 83.0, 80.0, 83.0, 82.0, 83.0, 84.0, 85.0], "unit": "score", "name": "stanford-crypto-aes", "value": 83.0}, {"lowerIsBetter": true, "replicates": [132.0, 126.0, 125.0, 125.0, 120.0, 125.0, 123.0, 122.0, 122.0, 121.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 124.1}, {"lowerIsBetter": true, "replicates": [136.0, 126.0, 145.0, 177.0, 173.0, 130.0, 137.0, 139.0, 136.0, 171.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 147.0}, {"lowerIsBetter": true, "replicates": [67.0, 66.0, 67.0, 67.0, 67.0, 67.0, 66.0, 69.0, 68.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 67.0}], "name": "kraken", "value": 1432.8999999999999}]} 11:18:14 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,59]]", "result": "1432.90"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,59]]", "result": "7442.70"}}} 11:18:14 INFO - Return code: 0 11:18:14 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 11:18:14 INFO - # TBPL SUCCESS # 11:18:14 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 11:18:14 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 11:18:14 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 11:18:14 INFO - 2016-02-07 11:18:14.976 screenresolution[1695:10260] starting screenresolution argv=screenresolution get 11:18:14 INFO - 2016-02-07 11:18:14.979 screenresolution[1695:10260] Display 0: 1600x1200x32@60 11:18:14 INFO - 2016-02-07 11:18:14.985 screenresolution[1696:10263] starting screenresolution argv=screenresolution list 11:18:14 INFO - Available Modes on Display 0 11:18:14 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 11:18:14 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 11:18:14 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 11:18:14 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 11:18:15 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 11:18:15 INFO - Intel Iris: 11:18:15 INFO - Chipset Model: Intel Iris 11:18:15 INFO - Type: GPU 11:18:15 INFO - Bus: Built-In 11:18:15 INFO - VRAM (Dynamic, Max): 1536 MB 11:18:15 INFO - Vendor: Intel (0x8086) 11:18:15 INFO - Device ID: 0x0a2e 11:18:15 INFO - Revision ID: 0x0009 11:18:15 INFO - Displays: 11:18:15 INFO - Display: 11:18:15 INFO - Resolution: 1600 x 1200 @ 60 Hz 11:18:15 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 11:18:15 INFO - Display Serial Number: 1600x1200 60 11:18:15 INFO - Main Display: Yes 11:18:15 INFO - Mirror: Off 11:18:15 INFO - Online: Yes 11:18:15 INFO - Rotation: Supported 11:18:15 INFO - Return code: 0 11:18:15 INFO - Running post-action listener: _resource_record_post_action 11:18:15 INFO - Running post-run listener: _resource_record_post_run 11:18:16 INFO - Total resource usage - Wall time: 1208s; CPU: 53.0%; Read bytes: 34254336; Write bytes: 712968704; Read time: 363; Write time: 1861 11:18:16 INFO - install - Wall time: 35s; CPU: 54.0%; Read bytes: 397517312; Write bytes: 392795648; Read time: 30054; Write time: 694 11:18:16 INFO - run-tests - Wall time: 1174s; CPU: 53.0%; Read bytes: 32472576; Write bytes: 302318592; Read time: 345; Write time: 1121 11:18:16 INFO - Running post-run listener: _upload_blobber_files 11:18:16 INFO - Blob upload gear active. 11:18:16 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:18:16 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 11:18:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 11:18:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 11:18:16 INFO - (blobuploader) - INFO - Open directory for files ... 11:18:16 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 11:18:16 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:18:16 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:18:17 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 11:18:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:18:17 INFO - (blobuploader) - INFO - Done attempting. 11:18:17 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 11:18:17 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:18:17 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:18:18 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 11:18:18 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:18:18 INFO - (blobuploader) - INFO - Done attempting. 11:18:18 INFO - (blobuploader) - INFO - Iteration through files over. 11:18:18 INFO - Return code: 0 11:18:18 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:18:18 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:18:18 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/67bb96aa7b20c8410375fd51501c696d6686505ce5d89c274e9a8612adfa2487e92604a50fcab86d1132168f3a59f3650db6f6c819147da9e51f2040163c037c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8f96ef1316b6c0fc0b10da8638d601111ea39f5f77a166de2d64e30c3cd07e4728ab95e0f7a79728c87187d7f766754e589730622eacf2338f96a19470c3fef6"} 11:18:18 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:18:18 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:18:18 INFO - Contents: 11:18:18 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/67bb96aa7b20c8410375fd51501c696d6686505ce5d89c274e9a8612adfa2487e92604a50fcab86d1132168f3a59f3650db6f6c819147da9e51f2040163c037c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8f96ef1316b6c0fc0b10da8638d601111ea39f5f77a166de2d64e30c3cd07e4728ab95e0f7a79728c87187d7f766754e589730622eacf2338f96a19470c3fef6"} 11:18:18 INFO - Running post-run listener: copy_logs_to_upload_dir 11:18:18 INFO - Copying logs to upload dir... 11:18:18 INFO - mkdir: /builds/slave/test/build/upload/logs 11:18:18 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1282.642804 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 22 secs) (at 2016-02-07 11:18:18.839689) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-07 11:18:18.842929) ========= 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.ag6rmJaZu4/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.UDujEqUfXo/Listeners TMPDIR=/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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 blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/67bb96aa7b20c8410375fd51501c696d6686505ce5d89c274e9a8612adfa2487e92604a50fcab86d1132168f3a59f3650db6f6c819147da9e51f2040163c037c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8f96ef1316b6c0fc0b10da8638d601111ea39f5f77a166de2d64e30c3cd07e4728ab95e0f7a79728c87187d7f766754e589730622eacf2338f96a19470c3fef6"} build_url:https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011182 build_url: 'https://queue.taskcluster.net/v1/task/TDVhjGP1QzCjNbU6ara-xg/artifacts/public/build/firefox-47.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/67bb96aa7b20c8410375fd51501c696d6686505ce5d89c274e9a8612adfa2487e92604a50fcab86d1132168f3a59f3650db6f6c819147da9e51f2040163c037c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8f96ef1316b6c0fc0b10da8638d601111ea39f5f77a166de2d64e30c3cd07e4728ab95e0f7a79728c87187d7f766754e589730622eacf2338f96a19470c3fef6"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-07 11:18:18.869670) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 11:18:18.870038) ========= 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.ag6rmJaZu4/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.UDujEqUfXo/Listeners TMPDIR=/var/folders/_p/g082hxs10zx5k7kq_ngsqt0h00000w/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.005005 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-07 11:18:18.920019) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-07 11:18:18.920661) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-07 11:18:18.921565) ========= ========= Total master_lag: 0.39 =========