builder: fx-team_yosemite_r7_test-dromaeojs-e10s slave: t-yosemite-r7-0024 starttime: 1458537928.98 results: success (0) buildid: 20160320203130 builduid: 7469b838778442e797520383825caf4e revision: e10424cf620fabac9a0850668bff5875583402f0 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:28.980245) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:28.980621) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:28.980960) ========= 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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners TMPDIR=/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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.005275 basedir: '/builds/slave/test' ========= master_lag: 0.06 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:29.042284) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:29.042552) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:29.085187) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:29.085476) ========= 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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners TMPDIR=/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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.005355 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:29.145030) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:29.145286) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:29.145612) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:29.145889) ========= 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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners TMPDIR=/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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-03-20 22:25:29-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 14.8M=0.001s 2016-03-20 22:25:29 (14.8 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.175145 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:29.340993) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:29.341267) ========= 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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners TMPDIR=/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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.025527 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:29.389235) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-20 22:25:29.389526) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev e10424cf620fabac9a0850668bff5875583402f0 --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 e10424cf620fabac9a0850668bff5875583402f0 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners TMPDIR=/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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-03-20 22:25:29,467 truncating revision to first 12 chars 2016-03-20 22:25:29,467 Setting DEBUG logging. 2016-03-20 22:25:29,467 attempt 1/10 2016-03-20 22:25:29,467 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/e10424cf620f?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-20 22:25:30,475 unpacking tar archive at: fx-team-e10424cf620f/testing/mozharness/ program finished with exit code 0 elapsedTime=1.254109 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-20 22:25:30.671634) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:30.672885) ========= echo e10424cf620fabac9a0850668bff5875583402f0 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'e10424cf620fabac9a0850668bff5875583402f0'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners TMPDIR=/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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 e10424cf620fabac9a0850668bff5875583402f0 program finished with exit code 0 elapsedTime=0.005570 script_repo_revision: 'e10424cf620fabac9a0850668bff5875583402f0' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:30.723929) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:30.727348) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-20 22:25:30.752760) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 35 secs) (at 2016-03-20 22:25:30.756023) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners TMPDIR=/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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 22:25:30 INFO - MultiFileLogger online at 20160320 22:25:30 in /builds/slave/test 22:25:30 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 22:25:30 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 22:25:30 INFO - {'append_to_log': False, 22:25:30 INFO - 'base_work_dir': '/builds/slave/test', 22:25:30 INFO - 'blob_upload_branch': 'Fx-Team', 22:25:30 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 22:25:30 INFO - 'branch': 'Fx-Team', 22:25:30 INFO - 'buildbot_json_path': 'buildprops.json', 22:25:30 INFO - 'config_files': ('talos/mac_config.py',), 22:25:30 INFO - 'default_actions': ('clobber', 22:25:30 INFO - 'read-buildbot-config', 22:25:30 INFO - 'download-and-extract', 22:25:30 INFO - 'populate-webroot', 22:25:30 INFO - 'create-virtualenv', 22:25:30 INFO - 'install', 22:25:30 INFO - 'run-tests'), 22:25:30 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 22:25:30 INFO - 'download_minidump_stackwalk': True, 22:25:30 INFO - 'download_symbols': 'ondemand', 22:25:30 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 22:25:30 INFO - 'tooltool.py': '/tools/tooltool.py', 22:25:30 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 22:25:30 INFO - '/tools/misc-python/virtualenv.py')}, 22:25:30 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 22:25:30 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 22:25:30 INFO - 'installer_path': 'installer.exe', 22:25:30 INFO - 'log_level': 'info', 22:25:30 INFO - 'log_name': 'talos', 22:25:30 INFO - 'log_to_console': True, 22:25:30 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 22:25:30 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 22:25:30 INFO - 'opt_config_files': (), 22:25:30 INFO - 'pip_index': False, 22:25:30 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 22:25:30 INFO - 'cmd': ('bash', 22:25:30 INFO - '-c', 22:25:30 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 22:25:30 INFO - 'enabled': True, 22:25:30 INFO - 'halt_on_failure': False, 22:25:30 INFO - 'name': 'check_screen_resolution'},), 22:25:30 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 22:25:30 INFO - 'cmd': ('bash', 22:25:30 INFO - '-c', 22:25:30 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 22:25:30 INFO - 'enabled': True, 22:25:30 INFO - 'halt_on_failure': False, 22:25:30 INFO - 'name': 'check_screen_resolution'},), 22:25:30 INFO - 'run_cmd_checks_enabled': True, 22:25:30 INFO - 'sps_profile': False, 22:25:30 INFO - 'sps_profile_interval': 0, 22:25:30 INFO - 'suite': 'dromaeojs-e10s', 22:25:30 INFO - 'system_bits': '32', 22:25:30 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 22:25:30 INFO - 'title': 't-yosemite-r7-0024', 22:25:30 INFO - 'tooltool_cache': '/builds/tooltool_cache', 22:25:30 INFO - 'use_talos_json': True, 22:25:30 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 22:25:30 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 22:25:30 INFO - 'work_dir': 'build'} 22:25:30 INFO - ##### 22:25:30 INFO - ##### Running clobber step. 22:25:30 INFO - ##### 22:25:30 INFO - Running pre-action listener: _resource_record_pre_action 22:25:30 INFO - Running main action method: clobber 22:25:30 INFO - rmtree: /builds/slave/test/build 22:25:30 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 22:25:32 INFO - Running post-action listener: _resource_record_post_action 22:25:32 INFO - ##### 22:25:32 INFO - ##### Running read-buildbot-config step. 22:25:32 INFO - ##### 22:25:32 INFO - Running pre-action listener: _resource_record_pre_action 22:25:32 INFO - Running main action method: read_buildbot_config 22:25:32 INFO - Using buildbot properties: 22:25:32 INFO - { 22:25:32 INFO - "project": "", 22:25:32 INFO - "product": "firefox", 22:25:32 INFO - "script_repo_revision": "production", 22:25:32 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs-e10s", 22:25:32 INFO - "repository": "", 22:25:32 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs-e10s", 22:25:32 INFO - "buildid": "20160320203130", 22:25:32 INFO - "pgo_build": "False", 22:25:32 INFO - "basedir": "/builds/slave/test", 22:25:32 INFO - "buildnumber": 554, 22:25:32 INFO - "slavename": "t-yosemite-r7-0024", 22:25:32 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 22:25:32 INFO - "platform": "yosemite_r7", 22:25:32 INFO - "scheduler": "tests-fx-team-macosx64-talos-7-3600", 22:25:32 INFO - "branch": "fx-team", 22:25:32 INFO - "repo_path": "integration/fx-team", 22:25:32 INFO - "revision": "e10424cf620fabac9a0850668bff5875583402f0", 22:25:32 INFO - "stage_platform": "macosx64", 22:25:32 INFO - "builduid": "7469b838778442e797520383825caf4e", 22:25:32 INFO - "slavebuilddir": "test" 22:25:32 INFO - } 22:25:32 INFO - Found installer url https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg. 22:25:32 INFO - Running post-action listener: _resource_record_post_action 22:25:32 INFO - ##### 22:25:32 INFO - ##### Running download-and-extract step. 22:25:32 INFO - ##### 22:25:32 INFO - Running pre-action listener: _resource_record_pre_action 22:25:32 INFO - Running main action method: download_and_extract 22:25:32 INFO - mkdir: /builds/slave/test/build/tests 22:25:32 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')]} 22:25:32 INFO - https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json matches https://queue.taskcluster.net 22:25:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json 22:25:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json 22:25:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json 22:25:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json'}, attempt #1 22:25:58 INFO - Downloaded 1199 bytes. 22:25:58 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json 22:25:58 INFO - Using the following test package requirements: 22:25:58 INFO - {u'common': [u'firefox-48.0a1.en-US.mac.common.tests.zip'], 22:25:58 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 22:25:58 INFO - u'firefox-48.0a1.en-US.mac.cppunittest.tests.zip'], 22:25:58 INFO - u'gtest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 22:25:58 INFO - u'firefox-48.0a1.en-US.mac.gtest.tests.zip'], 22:25:58 INFO - u'jittest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 22:25:58 INFO - u'jsshell-mac.zip'], 22:25:58 INFO - u'mochitest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 22:25:58 INFO - u'firefox-48.0a1.en-US.mac.mochitest.tests.zip'], 22:25:58 INFO - u'mozbase': [u'firefox-48.0a1.en-US.mac.common.tests.zip'], 22:25:58 INFO - u'reftest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 22:25:58 INFO - u'firefox-48.0a1.en-US.mac.reftest.tests.zip'], 22:25:58 INFO - u'talos': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 22:25:58 INFO - u'firefox-48.0a1.en-US.mac.talos.tests.zip'], 22:25:58 INFO - u'web-platform': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 22:25:58 INFO - u'firefox-48.0a1.en-US.mac.web-platform.tests.zip'], 22:25:58 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 22:25:58 INFO - u'firefox-48.0a1.en-US.mac.xpcshell.tests.zip']} 22:25:58 INFO - Downloading packages: [u'firefox-48.0a1.en-US.mac.common.tests.zip'] for test suite category: common 22:25: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')]} 22:25:58 INFO - https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 22:25:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 22:25:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 22:25:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip 22:25:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip'}, attempt #1 22:26:00 INFO - Downloaded 17858271 bytes. 22:26:00 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 22:26:00 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 22:26:03 INFO - Return code: 0 22:26:03 INFO - Downloading packages: [u'firefox-48.0a1.en-US.mac.common.tests.zip', u'firefox-48.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 22:26:03 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')]} 22:26:03 INFO - https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 22:26:03 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 22:26:03 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 22:26:03 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip 22:26:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip'}, attempt #1 22:26:06 INFO - Downloaded 17858271 bytes. 22:26:06 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 22:26:06 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 22:26:09 INFO - Return code: 0 22:26:09 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')]} 22:26:09 INFO - https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 22:26:09 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip 22:26:09 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip 22:26:09 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip 22:26:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip'}, attempt #1 22:26:11 INFO - Downloaded 10847637 bytes. 22:26:11 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 22:26:11 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 22:26:12 INFO - Return code: 0 22:26:12 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')]} 22:26:12 INFO - https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 22:26:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 22:26:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 22:26:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg 22:26:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg'}, attempt #1 22:26:17 INFO - Downloaded 111202499 bytes. 22:26:17 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 22:26:17 INFO - mkdir: /builds/slave/test/properties 22:26:17 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 22:26:17 INFO - Writing to file /builds/slave/test/properties/build_url 22:26:17 INFO - Contents: 22:26:17 INFO - build_url:https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 22:26:18 INFO - Running post-action listener: _resource_record_post_action 22:26:18 INFO - Running post-action listener: set_extra_try_arguments 22:26:18 INFO - ##### 22:26:18 INFO - ##### Running populate-webroot step. 22:26:18 INFO - ##### 22:26:18 INFO - Running pre-action listener: _resource_record_pre_action 22:26:18 INFO - Running main action method: populate_webroot 22:26:18 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 22:26:18 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 22:26:18 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 22:26:18 INFO - '--tppagecycles', 22:26:18 INFO - '7'], 22:26:18 INFO - 'tests': ['tsvgm']}}, 22:26:18 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 22:26:18 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 22:26:18 INFO - 'tests': ['tresize', 'tcanvasmark']}, 22:26:18 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 22:26:18 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 22:26:18 INFO - 'tests': ['dromaeo_css', 'kraken']}, 22:26:18 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:26:18 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 22:26:18 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:26:18 INFO - 'talos_options': ['--e10s'], 22:26:18 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 22:26:18 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:26:18 INFO - 'tests': ['damp', 'tps']}, 22:26:18 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:26:18 INFO - 'talos_options': ['--e10s'], 22:26:18 INFO - 'tests': ['damp', 'tps']}, 22:26:18 INFO - 'g3': {'tests': ['dromaeo_dom']}, 22:26:18 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 22:26:18 INFO - 'other': {'tests': ['a11yr', 22:26:18 INFO - 'ts_paint', 22:26:18 INFO - 'tpaint', 22:26:18 INFO - 'sessionrestore', 22:26:18 INFO - 'sessionrestore_no_auto_restore', 22:26:18 INFO - 'tabpaint']}, 22:26:18 INFO - 'other-e10s': {'talos_options': ['--e10s'], 22:26:18 INFO - 'tests': ['a11yr', 22:26:18 INFO - 'ts_paint', 22:26:18 INFO - 'tpaint', 22:26:18 INFO - 'sessionrestore', 22:26:18 INFO - 'sessionrestore_no_auto_restore', 22:26:18 INFO - 'tabpaint']}, 22:26:18 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 22:26:18 INFO - 'tests': ['a11yr', 22:26:18 INFO - 'ts_paint', 22:26:18 INFO - 'tpaint', 22:26:18 INFO - 'sessionrestore', 22:26:18 INFO - 'sessionrestore_no_auto_restore', 22:26:18 INFO - 'tabpaint']}, 22:26:18 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 22:26:18 INFO - 'tests': ['a11yr', 22:26:18 INFO - 'ts_paint', 22:26:18 INFO - 'tpaint', 22:26:18 INFO - 'sessionrestore', 22:26:18 INFO - 'sessionrestore_no_auto_restore', 22:26:18 INFO - 'tabpaint']}, 22:26:18 INFO - 'other_l64': {'tests': ['a11yr', 22:26:18 INFO - 'ts_paint', 22:26:18 INFO - 'tpaint', 22:26:18 INFO - 'sessionrestore', 22:26:18 INFO - 'sessionrestore_no_auto_restore', 22:26:18 INFO - 'tabpaint']}, 22:26:18 INFO - 'other_nol64': {'tests': ['a11yr', 22:26:18 INFO - 'ts_paint', 22:26:18 INFO - 'tpaint', 22:26:18 INFO - 'sessionrestore', 22:26:18 INFO - 'sessionrestore_no_auto_restore', 22:26:18 INFO - 'tabpaint']}, 22:26:18 INFO - 'svgr': {'tests': ['tsvgx', 22:26:18 INFO - 'tsvgr_opacity', 22:26:18 INFO - 'tart', 22:26:18 INFO - 'tscrollx', 22:26:18 INFO - 'cart']}, 22:26:18 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 22:26:18 INFO - 'tests': ['tsvgx', 22:26:18 INFO - 'tsvgr_opacity', 22:26:18 INFO - 'tart', 22:26:18 INFO - 'tscrollx', 22:26:18 INFO - 'cart']}, 22:26:18 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:26:18 INFO - 'tests': ['tp5o']}, 22:26:18 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:26:18 INFO - 'talos_options': ['--e10s'], 22:26:18 INFO - 'tests': ['tp5o']}, 22:26:18 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:26:18 INFO - 'talos_options': ['--xperf_path', 22:26:18 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 22:26:18 INFO - 'tests': ['tp5n']}, 22:26:18 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:26:18 INFO - 'talos_options': ['--e10s', 22:26:18 INFO - '--xperf_path', 22:26:18 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 22:26:18 INFO - 'tests': ['tp5n']}}, 22:26:18 INFO - 'talos.zip': {'path': '', 22:26:18 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 22:26:18 INFO - Running post-action listener: _resource_record_post_action 22:26:18 INFO - ##### 22:26:18 INFO - ##### Running create-virtualenv step. 22:26:18 INFO - ##### 22:26:18 INFO - Running pre-action listener: _resource_record_pre_action 22:26:18 INFO - Running main action method: create_virtualenv 22:26:18 INFO - Creating virtualenv /builds/slave/test/build/venv 22:26:18 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 22:26:18 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 22:26:18 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 22:26:18 INFO - Using real prefix '/tools/python27' 22:26:18 INFO - New python executable in /builds/slave/test/build/venv/bin/python 22:26:19 INFO - Installing distribute.............................................................................................................................................................................................done. 22:26:22 INFO - Installing pip.................done. 22:26:22 INFO - Return code: 0 22:26:22 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 22:26:22 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')]} 22:26:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:26:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:22 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')]} 22:26:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:26:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:22 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 0x10ab78a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab88420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f95d1d4d700>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa17e00>, '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 0x10a880db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10aa12b20>, '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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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 22:26:22 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 22:26:22 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 22:26:22 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.dHeCqV9X9h/Render', 22:26:22 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:26:22 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:26:22 INFO - 'HOME': '/Users/cltbld', 22:26:22 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:26:22 INFO - 'LOGNAME': 'cltbld', 22:26:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:26:22 INFO - 'MOZ_NO_REMOTE': '1', 22:26:22 INFO - 'NO_EM_RESTART': '1', 22:26:22 INFO - 'PAGER': '/bin/cat', 22:26:22 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:26:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:26:22 INFO - 'PWD': '/builds/slave/test', 22:26:22 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:26:22 INFO - 'SHELL': '/bin/bash', 22:26:22 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UY6ZVlQ2eb/Listeners', 22:26:22 INFO - 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/', 22:26:22 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:26:22 INFO - 'USER': 'cltbld', 22:26:22 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:26:22 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:26:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:26:22 INFO - 'XPC_FLAGS': '0x0', 22:26:22 INFO - 'XPC_SERVICE_NAME': '0', 22:26:22 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:26:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:26:22 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 22:26:22 INFO - Cleaning up... 22:26:22 INFO - Return code: 0 22:26:22 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 22:26:22 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')]} 22:26:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:26:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:22 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')]} 22:26:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:26:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:22 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 0x10ab78a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab88420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f95d1d4d700>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa17e00>, '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 0x10a880db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10aa12b20>, '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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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 22:26:22 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 22:26:22 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 22:26:22 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.dHeCqV9X9h/Render', 22:26:22 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:26:22 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:26:22 INFO - 'HOME': '/Users/cltbld', 22:26:22 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:26:22 INFO - 'LOGNAME': 'cltbld', 22:26:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:26:22 INFO - 'MOZ_NO_REMOTE': '1', 22:26:22 INFO - 'NO_EM_RESTART': '1', 22:26:22 INFO - 'PAGER': '/bin/cat', 22:26:22 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:26:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:26:22 INFO - 'PWD': '/builds/slave/test', 22:26:22 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:26:22 INFO - 'SHELL': '/bin/bash', 22:26:22 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UY6ZVlQ2eb/Listeners', 22:26:22 INFO - 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/', 22:26:22 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:26:22 INFO - 'USER': 'cltbld', 22:26:22 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:26:22 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:26:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:26:22 INFO - 'XPC_FLAGS': '0x0', 22:26:22 INFO - 'XPC_SERVICE_NAME': '0', 22:26:22 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:26:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:26:22 INFO - Downloading/unpacking psutil>=0.7.1 22:26:22 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 22:26:22 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 22:26:22 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 22:26:22 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 22:26:22 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 22:26:22 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 22:26:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 22:26:26 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 22:26:26 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 22:26:26 INFO - Installing collected packages: psutil 22:26:26 INFO - Running setup.py install for psutil 22:26:26 INFO - building 'psutil._psutil_osx' extension 22:26:26 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 22:26:26 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 22:26:26 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 22:26:27 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 22:26:27 INFO - building 'psutil._psutil_posix' extension 22:26:27 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 22:26:27 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 22:26:27 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 22:26:27 INFO - ^ 22:26:27 INFO - 1 warning generated. 22:26:27 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 22:26:27 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 22:26:27 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 22:26:27 INFO - Successfully installed psutil 22:26:27 INFO - Cleaning up... 22:26:27 INFO - Return code: 0 22:26:27 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 22:26: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')]} 22:26:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:26:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26: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')]} 22:26:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:26:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:27 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 0x10ab78a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab88420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f95d1d4d700>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa17e00>, '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 0x10a880db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10aa12b20>, '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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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 22:26:27 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 22:26:27 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 22:26:27 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.dHeCqV9X9h/Render', 22:26:27 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:26:27 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:26:27 INFO - 'HOME': '/Users/cltbld', 22:26:27 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:26:27 INFO - 'LOGNAME': 'cltbld', 22:26:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:26:27 INFO - 'MOZ_NO_REMOTE': '1', 22:26:27 INFO - 'NO_EM_RESTART': '1', 22:26:27 INFO - 'PAGER': '/bin/cat', 22:26:27 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:26:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:26:27 INFO - 'PWD': '/builds/slave/test', 22:26:27 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:26:27 INFO - 'SHELL': '/bin/bash', 22:26:27 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UY6ZVlQ2eb/Listeners', 22:26:27 INFO - 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/', 22:26:27 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:26:27 INFO - 'USER': 'cltbld', 22:26:27 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:26:27 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:26:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:26:27 INFO - 'XPC_FLAGS': '0x0', 22:26:27 INFO - 'XPC_SERVICE_NAME': '0', 22:26:27 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:26:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:26:27 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 22:26:27 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 22:26:27 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 22:26:27 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 22:26:27 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 22:26:27 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 22:26:27 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 22:26:30 INFO - Downloading mozsystemmonitor-0.0.tar.gz 22:26:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 22:26:30 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 22:26:30 INFO - Installing collected packages: mozsystemmonitor 22:26:30 INFO - Running setup.py install for mozsystemmonitor 22:26:30 INFO - Successfully installed mozsystemmonitor 22:26:30 INFO - Cleaning up... 22:26:30 INFO - Return code: 0 22:26:30 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 22:26:30 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')]} 22:26:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:26:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:30 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')]} 22:26:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:26:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:30 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 0x10ab78a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab88420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f95d1d4d700>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa17e00>, '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 0x10a880db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10aa12b20>, '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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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 22:26:30 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 22:26:30 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 22:26:30 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.dHeCqV9X9h/Render', 22:26:30 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:26:30 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:26:30 INFO - 'HOME': '/Users/cltbld', 22:26:30 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:26:30 INFO - 'LOGNAME': 'cltbld', 22:26:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:26:30 INFO - 'MOZ_NO_REMOTE': '1', 22:26:30 INFO - 'NO_EM_RESTART': '1', 22:26:30 INFO - 'PAGER': '/bin/cat', 22:26:30 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:26:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:26:30 INFO - 'PWD': '/builds/slave/test', 22:26:30 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:26:30 INFO - 'SHELL': '/bin/bash', 22:26:30 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UY6ZVlQ2eb/Listeners', 22:26:30 INFO - 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/', 22:26:30 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:26:30 INFO - 'USER': 'cltbld', 22:26:30 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:26:30 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:26:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:26:30 INFO - 'XPC_FLAGS': '0x0', 22:26:30 INFO - 'XPC_SERVICE_NAME': '0', 22:26:30 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:26:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:26:30 INFO - Downloading/unpacking blobuploader==1.2.4 22:26:30 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 22:26:30 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 22:26:30 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 22:26:30 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 22:26:30 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 22:26:30 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 22:26:32 INFO - Downloading blobuploader-1.2.4.tar.gz 22:26:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 22:26:33 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 22:26:33 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 22:26:33 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 22:26:33 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 22:26:33 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 22:26:33 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 22:26:33 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 22:26:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 22:26:33 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 22:26:33 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 22:26:33 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 22:26:33 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 22:26:33 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 22:26:33 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 22:26:33 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 22:26:34 INFO - Downloading docopt-0.6.1.tar.gz 22:26:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 22:26:34 INFO - Installing collected packages: blobuploader, requests, docopt 22:26:34 INFO - Running setup.py install for blobuploader 22:26:34 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 22:26:34 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 22:26:34 INFO - Running setup.py install for requests 22:26:34 INFO - Running setup.py install for docopt 22:26:35 INFO - Successfully installed blobuploader requests docopt 22:26:35 INFO - Cleaning up... 22:26:35 INFO - Return code: 0 22:26:35 INFO - Installing None into virtualenv /builds/slave/test/build/venv 22:26: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')]} 22:26:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:26:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26: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')]} 22:26:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:26:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:35 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 0x10ab78a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab88420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f95d1d4d700>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa17e00>, '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 0x10a880db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10aa12b20>, '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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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 22:26:35 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 22:26:35 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 22:26:35 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.dHeCqV9X9h/Render', 22:26:35 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:26:35 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:26:35 INFO - 'HOME': '/Users/cltbld', 22:26:35 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:26:35 INFO - 'LOGNAME': 'cltbld', 22:26:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:26:35 INFO - 'MOZ_NO_REMOTE': '1', 22:26:35 INFO - 'NO_EM_RESTART': '1', 22:26:35 INFO - 'PAGER': '/bin/cat', 22:26:35 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:26:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:26:35 INFO - 'PWD': '/builds/slave/test', 22:26:35 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:26:35 INFO - 'SHELL': '/bin/bash', 22:26:35 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UY6ZVlQ2eb/Listeners', 22:26:35 INFO - 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/', 22:26:35 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:26:35 INFO - 'USER': 'cltbld', 22:26:35 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:26:35 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:26:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:26:35 INFO - 'XPC_FLAGS': '0x0', 22:26:35 INFO - 'XPC_SERVICE_NAME': '0', 22:26:35 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:26:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:26:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 22:26:35 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-eABbMW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 22:26:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 22:26:35 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-0zc64u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 22:26:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 22:26:35 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-_JCvF_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 22:26:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 22:26:36 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-TmhPs3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 22:26:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 22:26:36 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-rgLvZY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 22:26:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 22:26:36 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-0DEDJt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 22:26:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 22:26:36 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-I3w6bh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 22:26:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 22:26:36 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-l5q_fr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 22:26:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 22:26:36 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-OhFrUF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 22:26:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 22:26:36 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-gtmqcA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 22:26:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 22:26:36 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-eCC3Cb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 22:26:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 22:26:36 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-CesEVX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 22:26:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 22:26:37 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-eEIcgj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 22:26:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 22:26:37 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-efvxIY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 22:26:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 22:26:37 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-Nd0eol-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 22:26:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 22:26:37 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-mSm4nK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 22:26:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 22:26:37 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-oYRu4j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 22:26:37 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 22:26:37 INFO - Running setup.py install for manifestparser 22:26:37 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 22:26:37 INFO - Running setup.py install for mozcrash 22:26:37 INFO - Running setup.py install for mozdebug 22:26:38 INFO - Running setup.py install for mozdevice 22:26:38 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 22:26:38 INFO - Installing dm script to /builds/slave/test/build/venv/bin 22:26:38 INFO - Running setup.py install for mozfile 22:26:38 INFO - Running setup.py install for mozhttpd 22:26:38 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 22:26:38 INFO - Running setup.py install for mozinfo 22:26:38 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 22:26:38 INFO - Running setup.py install for mozInstall 22:26:38 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 22:26:38 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 22:26:38 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 22:26:38 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 22:26:38 INFO - Running setup.py install for mozleak 22:26:38 INFO - Running setup.py install for mozlog 22:26:39 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 22:26:39 INFO - Running setup.py install for moznetwork 22:26:39 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 22:26:39 INFO - Running setup.py install for mozprocess 22:26:39 INFO - Running setup.py install for mozprofile 22:26:39 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 22:26:39 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 22:26:39 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 22:26:39 INFO - Running setup.py install for mozrunner 22:26:39 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 22:26:39 INFO - Running setup.py install for mozscreenshot 22:26:39 INFO - Running setup.py install for moztest 22:26:40 INFO - Running setup.py install for mozversion 22:26:40 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 22:26:40 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 22:26:40 INFO - Cleaning up... 22:26:40 INFO - Return code: 0 22:26:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 22:26: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')]} 22:26:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:26:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26: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')]} 22:26:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:26:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:40 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 0x10ab78a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab88420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f95d1d4d700>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa17e00>, '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 0x10a880db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10aa12b20>, '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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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 22:26:40 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 22:26:40 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 22:26:40 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.dHeCqV9X9h/Render', 22:26:40 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:26:40 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:26:40 INFO - 'HOME': '/Users/cltbld', 22:26:40 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:26:40 INFO - 'LOGNAME': 'cltbld', 22:26:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:26:40 INFO - 'MOZ_NO_REMOTE': '1', 22:26:40 INFO - 'NO_EM_RESTART': '1', 22:26:40 INFO - 'PAGER': '/bin/cat', 22:26:40 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:26:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:26:40 INFO - 'PWD': '/builds/slave/test', 22:26:40 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:26:40 INFO - 'SHELL': '/bin/bash', 22:26:40 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UY6ZVlQ2eb/Listeners', 22:26:40 INFO - 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/', 22:26:40 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:26:40 INFO - 'USER': 'cltbld', 22:26:40 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:26:40 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:26:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:26:40 INFO - 'XPC_FLAGS': '0x0', 22:26:40 INFO - 'XPC_SERVICE_NAME': '0', 22:26:40 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:26:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:26:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 22:26:40 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-KKtXES-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 22:26:40 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)) 22:26:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 22:26:40 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-3vnvVZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 22:26:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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)) 22:26:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 22:26:40 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-nUpZrs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 22:26:40 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)) 22:26:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 22:26:40 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-B0NEqH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 22:26:40 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)) 22:26:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 22:26:40 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-PSC4nk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 22:26:41 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)) 22:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 22:26:41 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-35d5CS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 22:26:41 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)) 22:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 22:26:41 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-frTqZW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 22:26:41 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)) 22:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 22:26:41 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-ToTqM4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 22:26:41 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)) 22:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 22:26:41 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-mYz6Xx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 22:26:41 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)) 22:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 22:26:41 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-C7uaJq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 22:26:41 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)) 22:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 22:26:41 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-hR3EkG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 22:26:41 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)) 22:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 22:26:41 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-cZuOrN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 22:26:41 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)) 22:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 22:26:41 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-VrIS3b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 22:26:41 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)) 22:26:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 22:26:41 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-vnbcYw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 22:26:42 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)) 22:26:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 22:26:42 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-SZVyJX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 22:26:42 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)) 22:26:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 22:26:42 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-6qZg16-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 22:26:42 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)) 22:26:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 22:26:42 INFO - Running setup.py (path:/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/pip-raz_Qs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 22:26:42 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)) 22:26:42 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 22:26:42 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 22:26:42 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)) 22:26:42 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)) 22:26:42 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)) 22:26:42 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 22:26:42 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 22:26:42 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 22:26:42 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 22:26:42 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 22:26:42 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 22:26:42 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 22:26:45 INFO - Downloading blessings-1.6.tar.gz 22:26:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 22:26:45 INFO - Installing collected packages: blessings 22:26:45 INFO - Running setup.py install for blessings 22:26:45 INFO - Successfully installed blessings 22:26:45 INFO - Cleaning up... 22:26:45 INFO - Return code: 0 22:26:45 INFO - Done creating virtualenv /builds/slave/test/build/venv. 22:26:45 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 22:26:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 22:26:45 INFO - Reading from file tmpfile_stdout 22:26:45 INFO - Current package versions: 22:26:45 INFO - blessings == 1.6 22:26:45 INFO - blobuploader == 1.2.4 22:26:45 INFO - docopt == 0.6.1 22:26:45 INFO - manifestparser == 1.1 22:26:45 INFO - mozInstall == 1.12 22:26:45 INFO - mozcrash == 0.17 22:26:45 INFO - mozdebug == 0.1 22:26:45 INFO - mozdevice == 0.48 22:26:45 INFO - mozfile == 1.2 22:26:45 INFO - mozhttpd == 0.7 22:26:45 INFO - mozinfo == 0.9 22:26:45 INFO - mozleak == 0.1 22:26:45 INFO - mozlog == 3.1 22:26:45 INFO - moznetwork == 0.27 22:26:45 INFO - mozprocess == 0.22 22:26:45 INFO - mozprofile == 0.28 22:26:45 INFO - mozrunner == 6.11 22:26:45 INFO - mozscreenshot == 0.1 22:26:45 INFO - mozsystemmonitor == 0.0 22:26:45 INFO - moztest == 0.7 22:26:45 INFO - mozversion == 1.4 22:26:45 INFO - psutil == 3.1.1 22:26:45 INFO - requests == 1.2.3 22:26:45 INFO - wsgiref == 0.1.2 22:26:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 22:26:45 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')]} 22:26:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:26:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:45 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')]} 22:26:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:26:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:45 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 0x10ab78a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab88420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f95d1d4d700>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa17e00>, '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 0x10a880db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10aa12b20>, '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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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 22:26:45 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 22:26:45 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 22:26:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.dHeCqV9X9h/Render', 22:26:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:26:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:26:45 INFO - 'HOME': '/Users/cltbld', 22:26:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:26:45 INFO - 'LOGNAME': 'cltbld', 22:26:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:26:45 INFO - 'MOZ_NO_REMOTE': '1', 22:26:45 INFO - 'NO_EM_RESTART': '1', 22:26:45 INFO - 'PAGER': '/bin/cat', 22:26:45 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:26:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:26:45 INFO - 'PWD': '/builds/slave/test', 22:26:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:26:45 INFO - 'SHELL': '/bin/bash', 22:26:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UY6ZVlQ2eb/Listeners', 22:26:45 INFO - 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/', 22:26:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:26:45 INFO - 'USER': 'cltbld', 22:26:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:26:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:26:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:26:45 INFO - 'XPC_FLAGS': '0x0', 22:26:45 INFO - 'XPC_SERVICE_NAME': '0', 22:26:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:26:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:26:45 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)) 22:26:45 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)) 22:26:45 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)) 22:26:45 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)) 22:26:45 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)) 22:26:45 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)) 22:26:45 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)) 22:26:45 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)) 22:26:45 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)) 22:26:45 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)) 22:26:45 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)) 22:26:45 INFO - Cleaning up... 22:26:45 INFO - Return code: 0 22:26:45 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 22:26:45 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')]} 22:26:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:26:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:45 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')]} 22:26:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:26:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:45 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 0x10ab78a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab88420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f95d1d4d700>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa17e00>, '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 0x10a880db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10aa12b20>, '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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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 22:26:45 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 22:26:45 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 22:26:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.dHeCqV9X9h/Render', 22:26:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:26:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:26:45 INFO - 'HOME': '/Users/cltbld', 22:26:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:26:45 INFO - 'LOGNAME': 'cltbld', 22:26:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:26:45 INFO - 'MOZ_NO_REMOTE': '1', 22:26:45 INFO - 'NO_EM_RESTART': '1', 22:26:45 INFO - 'PAGER': '/bin/cat', 22:26:45 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:26:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:26:45 INFO - 'PWD': '/builds/slave/test', 22:26:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:26:45 INFO - 'SHELL': '/bin/bash', 22:26:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UY6ZVlQ2eb/Listeners', 22:26:45 INFO - 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/', 22:26:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:26:45 INFO - 'USER': 'cltbld', 22:26:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:26:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:26:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:26:45 INFO - 'XPC_FLAGS': '0x0', 22:26:45 INFO - 'XPC_SERVICE_NAME': '0', 22:26:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:26:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:26:46 INFO - Downloading/unpacking jsonschema 22:26: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 22:26: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 22:26: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 22:26: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 22:26: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 22:26: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 22:26:48 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 22:26:48 INFO - Downloading/unpacking functools32 (from jsonschema) 22:26:48 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 22:26:48 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 22:26:48 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 22:26:48 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 22:26:48 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 22:26:48 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 22:26:49 INFO - Downloading functools32-3.2.3-2.tar.gz 22:26:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 22:26:49 INFO - warning: no files found matching '*.txt' 22:26:49 INFO - no previously-included directories found matching 'build' 22:26:49 INFO - no previously-included directories found matching 'dist' 22:26:49 INFO - no previously-included directories found matching '.git*' 22:26:49 INFO - Installing collected packages: jsonschema, functools32 22:26:49 INFO - Running setup.py install for functools32 22:26:49 INFO - warning: no files found matching '*.txt' 22:26:49 INFO - no previously-included directories found matching 'build' 22:26:49 INFO - no previously-included directories found matching 'dist' 22:26:49 INFO - no previously-included directories found matching '.git*' 22:26:49 INFO - Successfully installed jsonschema functools32 22:26:49 INFO - Cleaning up... 22:26:49 INFO - Return code: 0 22:26:49 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 22:26:49 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')]} 22:26:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:26:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:49 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')]} 22:26:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:26:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:26:49 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 0x10ab78a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10ab88420>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f95d1d4d700>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10aa17e00>, '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 0x10a880db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10aa12b20>, '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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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 22:26:49 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 22:26:49 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 22:26:49 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.dHeCqV9X9h/Render', 22:26:49 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:26:49 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:26:49 INFO - 'HOME': '/Users/cltbld', 22:26:49 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:26:49 INFO - 'LOGNAME': 'cltbld', 22:26:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:26:49 INFO - 'MOZ_NO_REMOTE': '1', 22:26:49 INFO - 'NO_EM_RESTART': '1', 22:26:49 INFO - 'PAGER': '/bin/cat', 22:26:49 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:26:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:26:49 INFO - 'PWD': '/builds/slave/test', 22:26:49 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:26:49 INFO - 'SHELL': '/bin/bash', 22:26:49 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UY6ZVlQ2eb/Listeners', 22:26:49 INFO - 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/', 22:26:49 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:26:49 INFO - 'USER': 'cltbld', 22:26:49 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:26:49 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:26:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:26:49 INFO - 'XPC_FLAGS': '0x0', 22:26:49 INFO - 'XPC_SERVICE_NAME': '0', 22:26:49 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:26:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:26:49 INFO - Downloading/unpacking flake8 22:26:49 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 22:26:49 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 22:26:49 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 22:26:49 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 22:26:49 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 22:26:49 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 22:26:52 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 22:26:52 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 22:26:52 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 22:26:52 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 22:26:52 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 22:26:52 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 22:26:52 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 22:26:52 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 22:26:52 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 22:26:52 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 22:26:52 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 22:26:52 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 22:26:52 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 22:26:52 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 22:26:52 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 22:26:52 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 22:26:52 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 22:26:52 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 22:26:52 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 22:26:52 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 22:26:52 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 22:26:52 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 22:26:52 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 22:26:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 22:26:53 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 22:26:53 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 22:26:53 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 22:26:53 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 22:26:53 INFO - no previously-included directories found matching 'docs/_build' 22:26:53 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 22:26:53 INFO - Running setup.py install for pep8 22:26:53 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 22:26:53 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 22:26:53 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 22:26:53 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 22:26:53 INFO - no previously-included directories found matching 'docs/_build' 22:26:53 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 22:26:53 INFO - Successfully installed flake8 mccabe pyflakes pep8 22:26:53 INFO - Cleaning up... 22:26:53 INFO - Return code: 0 22:26:53 INFO - Running post-action listener: _resource_record_post_action 22:26:53 INFO - Running post-action listener: _start_resource_monitoring 22:26:53 INFO - Starting resource monitoring. 22:26:53 INFO - ##### 22:26:53 INFO - ##### Running install step. 22:26:53 INFO - ##### 22:26:53 INFO - Running pre-action listener: _resource_record_pre_action 22:26:53 INFO - Running main action method: install 22:26:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 22:26:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 22:26:53 INFO - Reading from file tmpfile_stdout 22:26:53 INFO - Detecting whether we're running mozinstall >=1.0... 22:26:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 22:26:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 22:26:54 INFO - Reading from file tmpfile_stdout 22:26:54 INFO - Output received: 22:26:54 INFO - Usage: mozinstall [options] installer 22:26:54 INFO - Options: 22:26:54 INFO - -h, --help show this help message and exit 22:26:54 INFO - -d DEST, --destination=DEST 22:26:54 INFO - Directory to install application into. [default: 22:26:54 INFO - "/builds/slave/test"] 22:26:54 INFO - --app=APP Application being installed. [default: firefox] 22:26:54 INFO - mkdir: /builds/slave/test/build/application 22:26:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 22:26:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 22:27:27 INFO - Reading from file tmpfile_stdout 22:27:27 INFO - Output received: 22:27:27 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 22:27:27 INFO - Running post-action listener: _resource_record_post_action 22:27:27 INFO - ##### 22:27:27 INFO - ##### Running run-tests step. 22:27:27 INFO - ##### 22:27:27 INFO - Running pre-action listener: _resource_record_pre_action 22:27:27 INFO - Running main action method: run_tests 22:27:27 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 22:27:27 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 22:27:27 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 22:27:27 INFO - 2016-03-20 22:27:27.648 screenresolution[1652:7690] starting screenresolution argv=screenresolution get 22:27:27 INFO - 2016-03-20 22:27:27.650 screenresolution[1652:7690] Display 0: 1600x1200x32@60 22:27:27 INFO - 2016-03-20 22:27:27.656 screenresolution[1653:7692] starting screenresolution argv=screenresolution list 22:27:27 INFO - Available Modes on Display 0 22:27:27 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 22:27:27 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 22:27:27 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 22:27:27 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 22:27:27 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 22:27:27 INFO - Intel Iris: 22:27:27 INFO - Chipset Model: Intel Iris 22:27:27 INFO - Type: GPU 22:27:27 INFO - Bus: Built-In 22:27:27 INFO - VRAM (Dynamic, Max): 1536 MB 22:27:27 INFO - Vendor: Intel (0x8086) 22:27:27 INFO - Device ID: 0x0a2e 22:27:27 INFO - Revision ID: 0x0009 22:27:27 INFO - Displays: 22:27:27 INFO - Display: 22:27:27 INFO - Resolution: 1600 x 1200 @ 60 Hz 22:27:27 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 22:27:27 INFO - Display Serial Number: 1600x1200 60 22:27:27 INFO - Main Display: Yes 22:27:27 INFO - Mirror: Off 22:27:27 INFO - Online: Yes 22:27:27 INFO - Rotation: Supported 22:27:27 INFO - Return code: 0 22:27:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 22:27:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 22:27:27 INFO - Python 2.7.3 22:27:27 INFO - Return code: 0 22:27:27 INFO - grabbing minidump binary from tooltool 22:27: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')]} 22:27:27 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 0x10aa17e00>, '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 0x10a880db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10aa12b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 22:27:27 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 22:27:27 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 22:27:27 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 22:27:27 INFO - Return code: 0 22:27:27 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 22:27:27 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 22:27:27 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 22:27:27 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 22:27:27 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 22:27:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 22:27:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 22:27:29 INFO - Return code: 0 22:27:29 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-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0024', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 22:27:29 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-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0024 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 22:27:29 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.dHeCqV9X9h/Render', 22:27:29 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 22:27:29 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 22:27:29 INFO - 'HOME': '/Users/cltbld', 22:27:29 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 22:27:29 INFO - 'LOGNAME': 'cltbld', 22:27:29 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 22:27:29 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 22:27:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:27:29 INFO - 'MOZ_NO_REMOTE': '1', 22:27:29 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 22:27:29 INFO - 'NO_EM_RESTART': '1', 22:27:29 INFO - 'PAGER': '/bin/cat', 22:27:29 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 22:27:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:27:29 INFO - 'PWD': '/builds/slave/test', 22:27:29 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 22:27:29 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 22:27:29 INFO - 'SHELL': '/bin/bash', 22:27:29 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.UY6ZVlQ2eb/Listeners', 22:27:29 INFO - 'TMPDIR': '/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/', 22:27:29 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 22:27:29 INFO - 'USER': 'cltbld', 22:27:29 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 22:27:29 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 22:27:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:27:29 INFO - 'XPC_FLAGS': '0x0', 22:27:29 INFO - 'XPC_SERVICE_NAME': '0', 22:27:29 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 22:27:29 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0024', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 22:27:29 INFO - mozversion application_buildid: 20160320203130 22:27:29 INFO - mozversion application_changeset: e10424cf620fabac9a0850668bff5875583402f0 22:27:29 INFO - mozversion application_display_name: Nightly 22:27:29 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 22:27:29 INFO - mozversion application_name: Firefox 22:27:29 INFO - mozversion application_remotingname: firefox 22:27:29 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 22:27:29 INFO - mozversion application_vendor: Mozilla 22:27:29 INFO - mozversion application_version: 48.0a1 22:27:29 INFO - mozversion platform_buildid: 20160320203130 22:27:29 INFO - mozversion platform_changeset: e10424cf620fabac9a0850668bff5875583402f0 22:27:29 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 22:27:29 INFO - mozversion platform_version: 48.0a1 22:27:29 INFO - using testdate: 1458538049 22:27:29 INFO - actual date: 1458538049 22:27:29 INFO - starting webserver on 'localhost:49278' 22:27:29 INFO - SUITE-START | Running 2 tests 22:27:29 INFO - TEST-START | dromaeo_css 22:27:29 INFO - operating with platform_type : mac_ 22:27:29 INFO - Initialising browser for dromaeo_css test... 22:27:29 INFO - TEST-INFO | started process 1671 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/tmpxXi9be/profile http://localhost:49278/getInfo.html) 22:27:31 INFO - PROCESS | 1671 | JavaScript error: jar:file:///builds/slave/test/build/application/Nightly.app/Contents/Resources/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 22:27:32 INFO - PROCESS | 1671 | __metrics Screen width/height:1600/1200 22:27:32 INFO - PROCESS | 1671 | colorDepth:24 22:27:32 INFO - PROCESS | 1671 | Browser inner width/height: 1024/689 22:27:32 INFO - PROCESS | 1671 | __metrics 22:27:32 ERROR - PROCESS | 1671 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 22:27:33 INFO - TEST-INFO | 1671: exit 0 22:27:33 INFO - Browser initialized. 22:27:33 INFO - Running cycle 1/1 for dromaeo_css test... 22:27:33 INFO - TEST-INFO | started process 1675 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/tmpxXi9be/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 22:27:45 INFO - PROCESS | 1675 | RSS: Main: 257675264 22:27:45 INFO - PROCESS | 1675 | 22:28:35 INFO - PROCESS | 1675 | 1458538115017 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] 22:30:47 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49278/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49278/tests/dromaeo/cssquery-ext.html) 22:30:48 INFO - PROCESS | 1675 | RSS: Main: 269750272 22:30:48 INFO - PROCESS | 1675 | 22:33:50 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49278/tests/dromaeo/cssquery-ext.html (next: http://localhost:49278/tests/dromaeo/cssquery-jquery.html) 22:33:51 INFO - PROCESS | 1675 | RSS: Main: 281477120 22:33:51 INFO - PROCESS | 1675 | 22:36:53 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49278/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49278/tests/dromaeo/cssquery-mootools.html) 22:36:53 INFO - PROCESS | 1675 | RSS: Main: 283684864 22:36:53 INFO - PROCESS | 1675 | 22:39:55 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49278/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49278/tests/dromaeo/cssquery-prototype.html) 22:39:56 INFO - PROCESS | 1675 | RSS: Main: 283910144 22:39:56 INFO - PROCESS | 1675 | 22:42:58 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49278/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49278/tests/dromaeo/cssquery-yui.html) 22:42:59 INFO - PROCESS | 1675 | RSS: Main: 286732288 22:42:59 INFO - PROCESS | 1675 | 22:46:01 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49278/tests/dromaeo/cssquery-yui.html (next: http://localhost:49278/tests/dromaeo/cssquery-dojo.html) 22:46:02 INFO - PROCESS | 1675 | RSS: Main: 289923072 22:46:02 INFO - PROCESS | 1675 | 22:46:02 INFO - PROCESS | 1675 | __start_tp_report 22:46:02 INFO - PROCESS | 1675 | _x_x_mozilla_page_load 22:46:02 INFO - PROCESS | 1675 | _x_x_mozilla_page_load_details 22:46:02 INFO - PROCESS | 1675 | |i|pagename|runs| 22:46:02 INFO - PROCESS | 1675 | |0;dojo.html;3482.373172828891;3509.9649003509967;3530.240998185391;3534.3991521441367;3565.9821700891493;5009.248612708096;5490.6431081979645;5768.19245305657;5828.825135245944;5841.0946303323;5682.17608446775;5775.422457754223;5843.035899076647;5865.941340586593;5878.617889837157;5230.1108811502045;5265.078611243036;5309.707966061865;5321.494458026481;5386.649867758602;5324.467553244684;5338.893222135555;5412.729363531827;5432.103702889039;5487;5225.294585230983;5272.657277276965;5340.866478338034;5341.359036915556;5354.089804733185;3921.6470517653547;5256.579473642099;5272.894542109175;5293.7353132343615;5297.417284098746;5263.842084737464;5267.209918512254;5280;5306.867328316785;5330.653507521999;5562.527185189264;5606.887862242773;5680.687562184078;5771.942280577183;5808.88382232353;5427.45725427458;6298.874022519524;6306.716197771111;6309.400606942333;6316.747330106836;6183.103499775983;6235.064740288947;6241.812745617639;6259.749610015594;6260.686965651699;4987.650864439527;5824.301083869963;5950.880982380371;5963.970180149072;5970.044792833126;6249.6562689052535;6285.151504546919;6309;6335.588186767845;6344.936550634527;6167.537434692416;6255.12428260044;6275.466585340298;6291.653959032297;6296.087067375205;6147.801178770186;6172.845678857974;6286.465650419674;6300.59046161998;6308.495320374359;6282.371762823681;6291.5281353898645;6292.653904035231;6298.338674439118;6299.6850157491945;6245.937540624535;6253.499720022387;6310.368963103653;6317.210348706411;6320.27316858558;4882.5605695486865;4946.975265123723;4981.850544483671;4996.475370086161;5023.271625614266;4456.131054444352;4465.620422264079;4470.262406702857;4473.367220964325;4479.955200447954;5839.153322768175;5906.5570082244;5923.674197919156;5945.16767652529;5965.612235204698;6196.597221180609;6200.503959683305;6227.564070515021;6232.75068997235;6259.374062593795;5904.917120483371;5917.467427931507;5925.970370148121;5926.436988486087;5983.790567330123;5271.710055946883;5442.6462279951675;5464.426235245322;5481.177823326533;5512.200730893998;6339.302676705559;6371.39471750183;6427.517936154713;6447.516436267392;6454.838629034311;6244.125822384961;6259.467945224706;6259.96870015647;6274.247090349188;6276.246850377984;6241.282252541016;6361.650109243851;6380.585261957958;6404.423601875667;6407.679616019087;6139.400144844221;6208.689565521796;6229.190205273286;6242.438180563771;6271.498280137487;6077.848053798691;6232.376762323732;6258.749650014131;6259.1550140730415;6272.09054687077;6132.938670613236;6168;6236.65698386575;6239.78160764371;6249.625022498664;6143.986242269975;6148.139260503623;6175.6912154393;6210.4100110489435;6224.564280500322;5966.850828729316;6032.366601506778;6104.603200791934;6107.144999700135;6117.785877494266;6059.697015149137;6121.5139442231075;6186.4741496973265;6193.406025425623;6252.656103914328;6019.976603977422;6069.180660610761;6072.453479186895;6089.786857459968;6100.2984656763265 22:46:02 INFO - PROCESS | 1675 | |1;ext.html;460.3417113527654;571.5085026876885;599.0684485624852;632.1371328137094;640.420419520334;38901.02747431312;39399.803000985026;39505.4074188887;39572.40641390382;39626.8018659907;33627.495587566205;40622.39066414006;41354.172916541655;41404.37893431601;41470.58529414705;9335.62657493701;9469.384490008128;9478.952605236964;9516.23870090391;9563.426194428323;9425.76435589109;9634.181094606933;9650.806983860319;9660.178884794766;9665.613375464973;9624.903750962505;9672.854907176397;9703.417794932291;9731.805363892718;9736.805263894717;9592.712218633453;9663.985281545407;9682.75793105178;9685.273604479622;9696.563654635524;9491.66779162733;9626.951865240699;9631.880986183029;9639.132478076937;9643.807123857554;32997.6700232997;39766.60233397658;39958;40094.7924166066;40268.597314026774;3141.6387115481784;3278.49183376577;3474.8262586870555;3949.940750888739;4116.91766164678;28579.857100714362;28695.713042869513;28746.281342966384;28803.56794648082;28978.71021289781;2667.5198464276423;2672.719364466742;2752.0505425628126;2760.2961244882426;2760.3513174403997;336603.316983416;337501;338781;340691;340779.2961035204;46793.29810052852;47269.527304726515;59984;62016.75966480645;62067.37932620706;44856.55143448589;44952.55047449549;45030.549694503294;45124.77437612791;45152.096958060654;16186.352545898033;16313.429029983894;16377.344906203618;16383.262753176135;16440.013599184087;12547.874521254671;12912.677183070498;12975.870241297465;13010.894074003816;13046.739065218831;15272.31274592646;15277.236138193268;15307.693846123015;15339.309731061905;15368.846311536965;5637.774489020393;6073.937061014393;6521.347865213441;6713;6716.5634233774645;1008.7478130467383;1023.7798873242289;1033.8007910823408;1061.936283822973;1169.2107827216594;29982.850085749433;30283.848580756956;30317.242068948013;30977.380452390826;31044.68955310418;990.0446069542926;1097.4951522299673;1170.3329102411715;1190.9285442873456;1256.5978886756334;14018.299085045706;14982.925085374503;15356;15480.993735407163;15898.76151857723;502946;505271;506484;511631;511831;58435.403397558046;60383.396166037775;61214.69392653097;62012.68993655003;62111.689441553404;1174.3775798826637;1370.6025252676811;1452.1867754057762;1467.7504824179914;1497.0194522587722;30244.395112097194;30360.54459183158;30364.223236167323;30514;31060.378792424475;52957.7352113237;53083.14209002666;53273.7336313316;53344;53522.46477535175;479797;480427;482937;485125;485896;34583.65416345804;34994.60021599108;44991.32513012373;45870.54129458663;47128.764356178;40642;43866;44469.88825279394;45152.77423612861;45670.771646141555;33832.66167338393;34794.478082829286;35237.82381088078;35263.29473410466;36059.81970090133;35845.28309433849;35859.46210806788;36510.4523432154;36567.63432365749;36645.26709465742;33887.49168762421;37086.072848179014;37727;38872.222555548164;39304.213915722095;31407.685923140478;32103.876364327138;32115.518267225543;32151.67848321487;32221;21282.57434851325;24192.637110443004;24669.50660986734;25975;26024.609630855175 22:46:02 INFO - PROCESS | 1675 | |2;jquery.html;343.62544826139504;365.8280608114187;366.8000939487979;368.13121034358926;373.48086160237256;19364.806351936477;19376.612467750656;20260.39218823434;20260.696089558667;20315.49211269719;19529.609407811837;20345.49136271594;20640.48398790031;20712.171513139496;21290.89354553229;5596.58025648076;5890.499307558863;5927.733252003649;5930.051191809312;5933.199018132562;4196.244675958326;5773.971130144343;6363.236411630611;6646.900296495556;6669.933300666979;6512.576682515645;6572.507061970347;6593.53845230834;6596.076549283104;6596.373344532286;6208.627482351051;6340;6348.555601107924;6352.174217351738;6370.140031095789;5332.226827110087;5443.2107344435235;5512;5515.283013208297;5516.862078448031;25019.249422517354;25085.996560137573;25299.735013249447;25716.042655094716;25822.967081316725;2080.5006798368436;2139.775323591032;2267.444476103365;2295.1622657729977;2529.468811549577;14714.225782607835;14992.850071499364;15082.24588770557;15133.243337833175;15357.232138393036;1667.816540180579;1756.8331008554294;1758.2175931710394;1814.165483877418;1820.2627935686069;98004;98121;100493.4975325126;101736;104131.47934260356;11038.834417483744;11185.217034807649;11206.719832004264;11216.878312168717;11249;13363.53227637028;13437.798433023512;13472.86527134716;13523.391447384694;13562.05065645415;8173.346132309401;8198.344132469389;8312.168783121639;8321.417500774887;8384.580770961427;7575.507592006612;8255.669773209005;8302.418830681914;8354.916450835413;8433.915660843313;4089.6932730045364;4105.137921036616;4416.779161041935;4472.955270447319;4485.506594274627;1780.5993651428585;1823.6170404214997;1856.7029275316154;1870.9345172918881;1874.7937726850037;837.6942416018231;887.6360692116331;894.4320356573622;900.2392977933636;1003.2074661017714;17733.46799596014;19835;20123.899380503295;20225.089870955842;20310.289139880035;971.6259240192577;975.068809287129;979.3829887171037;1024.0987930621154;1062.4581463453694;10856;10920.890791091988;11014.944925275322;11017;11022.228444009002;539451;575387;617829;627187;639450;66833.66583167053;78165.60917195491;94705.05294946962;105540.47229763801;109459.90540094656;1009.333839665817;1023.7952409518126;1026.6817286641165;1039.740064983754;1044.1751016696724;17735.37926172578;17957.281708731505;17999.010054446608;18116.591035745478;18253.269869205615;33616.83191584027;45850.77074614605;46940.53059469361;47808.282875756195;49588;67974;67974.32025679878;68122;68846.311536884;69072.30927690859;7189.2451292615615;7525.435592330707;7669.156392796899;7853.175416581176;7943.33190030077;10701.892981070401;12066.336351500751;12140;12532.436040378023;12545.749085018431;10545.894541054799;10668.14543928522;10765.3540787553;10815.893960653155;10863.239573229797;10399;10494.370337779757;10556.155507559222;10938.835917461403;11050.723731906444;9163.541822908961;10013.648157498936;10310.43292618913;10684.198685098494;11352.54589816398;7600.239976002355;7658.8085297868;7724.806879828049;7822.530648161129;7960.721374751856;10537.26239163282;10671.786564268827;10684.946575267384;10915.617953371593;10970.780584388427 22:46:02 INFO - PROCESS | 1675 | |3;mootools.html;1568.6784209237107;1638.3937942961106;1937.7577802774645;2010.2260629657587;2016.8789872607654;7685.50044247125;8515.829683406344;8761.25529330007;8985.10148985102;8991.055939126396;7275.236100209481;8799.34004949628;8895.154960278764;8908.198262156404;8915.331350148748;2115.6720708290163;2506.8119891008155;2515.748425157488;2528.115159694111;2537.6320433537126;2466.2056035621836;2535.1887396033276;2555.7699807017366;2561.129216066546;2562.7309132541095;2211.9889400552975;2462.9753702462926;2497.463045445229;2525.8105642076825;2541.07250853439;2486.5772818620876;2488.850668959868;2516.207394670691;2529.1527338341584;2534.4297533055005;2494.6382774497597;2507.4232926426844;2531.4430825218424;2536.239128261514;2537.0612873236837;8887.644494220223;8907.198352148338;8918.063603321623;8921.732348029569;9386.812263754686;4367.366731823868;4820.180569303192;5024.949750502485;5444.482774136451;5610.354809196954;3533.9116522086897;3546.5389499365174;3572.8928132156075;3765.755225910307;3793.0896584819443;1033.762234686019;1051.733514276735;1053.227183386602;1054.9419781911993;1065.1957771882257;12186.939065304618;12332.506699732;12377.876221237853;12382.31897245651;12389.318587477776;4663.603593694574;5056.848294551096;5089.821856235014;5095.210242412432;5178.585713142939;10220.6422775204;10439.112675422522;10450.843237351446;10455.477226138815;10470.319429237075;4492.595666389975;5611.9438805612235;5616.719164041781;5674.77300907959;5700.116481945305;5058.620603454756;5119.513646203679;5121.897562048738;5144.459831717691;5158.664686795421;4081.449049361283;4088.5707000765087;4134.669226461876;4138.193052354822;4148.668106551469;1257.654145110102;1347.764141275273;1362.087401441037;1374.4021350712471;1375.7386096641605;1056.5140035583718;1167.3171194851107;1169.590643274847;1348.615644541301;1438.8633079857398;8130.674773009132;8228.711995080144;8276.627551760064;8323.750287491384;8335;1124.3366413815888;1227.3372378915285;1229.299299399334;1241.6461308527028;1249.331607589935;6283.6858157091965;6320.841978950563;6347.619142851351;6369.172007638977;6392.041193820871;10684.893151068545;10967.341959482457;11017.11863050954;11079.72300692489;11095.778084438267;10609.681709548726;10874.782504350027;10878.40168790724;10904.07315378186;11020.669379918616;8482.533460659599;8531.976162860372;8533.146685331418;8539.14608539141;8593.097724738938;7935.285824275843;8039.196080391914;8073.990751156105;8101.716439924574;8107.1892810718455;9425.481598512148;9785.657501987682;9850.261230407605;9864.704058878246;9914.157296629868;9785.266105042008;10065.547050382604;10111.03945125212;10146.883842777435;10208.285420020824;7594.658240379306;7680.462367634212;7693.153753087044;7708.152103268524;7714.652840622298;8441.28249098809;8447.619857106567;8525.275351594935;8528.360372971927;8542.78643033929;7527.8118047049265;7665.6933722650465;7704.114026886979;7732.265434783687;7778.183290754389;7452.627368631655;7468.439867009887;7514.774556763306;7566.394688425023;7603.7338693145475;7971.681132754625;7975.082865470546;8003.319717823817;8072;8077.434579579373;7209.387202087882;7260.782176534713;7263.673134708845;7270.600116993616;7305.379042781211;7343.632818359168;7371;7373.188949215475;7398.2231865655485;7425.665845037094 22:46:02 INFO - PROCESS | 1675 | |4;prototype.html;333.12886801015344;333.76636354551806;336.2484846368368;341.1182094286268;342.20778896853784;6787.694553745081;6801.489888258382;6814.5911245325315;6817.147856517935;6850.451963842893;6729.125213722222;6730.293319201487;6736.831579210522;6747.831304217397;6759.357861003209;4123.865936867371;4773.618110551165;4879.487653796354;5004.724740139291;5022.397312322526;4454.641334393009;4540.704854184468;4657.953420465786;4949.925751113737;5057.620678449112;3885.5531613864346;4343.087951530182;4731.408573928259;4965.3048573199785;4998.225275082368;5000.599952003831;5000.749962501878;5013.298138260647;5030;5099.821506247301;3319.668033196685;3651.452282157671;4219.156168766228;4317.4819021717285;4318.69769116162;4965.950340496585;6516.967415162894;6560.278369379364;6562.409383155491;6591.274959754423;5711.714414279311;5720.427957204288;5738.8278351649515;5749.965006298865;5756.136579513065;6228.657423841687;7189.676464559107;7247.275272472711;7267.854642907165;7283.4537409694485;4659.510751371091;4662.860114196579;4666.53334666534;4672.929906051412;4702.3416721659;7584.886226706604;7635.809104772369;7641.847163056764;7647.770566882947;7677.078750549914;4517.480489743722;4698.624110071186;4712.976435117803;4726.220173671374;4732.384789977281;4777.880552986134;4802.111609352281;4805.8077676892535;4810.5670489655395;4810.831620893322;5741.655500669973;5756.510696590753;5770.047942089592;5785.30576330843;5792.189093526909;7223.819404514929;7233.095863017123;7248.565086094851;7251;7261.636918154071;1492.2837038221714;1581.5808810665183;1656.3705791799039;1667.316400275881;1687.0552490605055;1030.7783826477344;1068.3269540189785;1073.4364458659265;1086.28305318491;1086.4893500054961;6618.834529136714;6712.463002959751;6729.360710732472;6745.190577130776;6765.898511522331;7484.438667099989;7487.850242995219;7492.587907665022;7498.100227972569;7522.247775222434;5304.708241046779;6580.374864387875;6740.191177058784;6804.455643548505;6826.146731658543;3948.1314110895555;3978.701597380208;4002.899927501836;4007.6393124618926;4009.0177906413114;6933.682600305926;7403.888941665771;7872.527648341003;7901.288884000468;7922.326602238759;7528.322450979438;7784.532928024337;7837.529748215125;7838;7838.529688218725;6406.327335629691;6488.902666460007;7773.339266162439;7924.366050715929;7946.04647442299;6124.418180272867;7454.440916931143;7510.098788145458;7523.774286771406;7547.886781698169;6709.127813384229;7416.4066874648815;7420.295071968154;7435.219301973431;7439.51643143194;6720.361565651256;7581.810454738676;7869.5278283300895;7899.09160446556;7904.446688731734;4691.319758634911;4717.976410117927;4721.929171062506;4727.692699974491;4752.144613969519;5694.914576281442;6839.692213850488;7493.250674932463;7541;7562.697492100255;7230.240824713329;7243.0946131733535;7260.564366137837;7272.454565907472;7313.158986716596;6910.136232970879;7230.530015548972;7241.782746517613;7260.600666963368;7262.201157872524;7040.471964602778;7074.610896400747;7076.398506127037;7097.112860892388;7109.537880037781;7237.855242895007;7240.818979525343;7252.2747725229165;7263.636818159177;7291.234420385783;7071.929280707127;7086.149662040588;7103.502754807114;7104.076470058859;7134.32223938725 22:46:02 INFO - PROCESS | 1675 | |5;yui.html;678;690.3476214976846;718.0880282041807;726.0162479839817;727.2073439950453;15029.924850375746;15143.394264229417;15190.468333608325;15278.46525371611;15313.38746450142;14091.224982625952;14114.082584631991;14165.220912849789;14211.857881421183;14252.572422827307;694.503430047516;704.2781149321935;757.8181236503227;821.1829229916212;931.3015238571072;862.7670528957209;900.3562452846213;905.8641203819413;915.4781774388601;916.1708653668408;954.4511905654276;965.4110992294694;976.2726768557435;981.4847205217283;990.4107056301489;959.4627008874983;967.1440774914181;968.5157421289356;972.8248915195262;972.868662730533;710.2506855267691;720.7117153138734;728.0571659700647;730.8611363840853;732.3445516262968;14653.926730366387;14826.036307639968;14837.109773413522;14862.331195096247;14871.33079011447;12996.610101696964;13002.609921702364;13017.739645207137;13029.459255445192;13063.86936130636;10006.349587276804;10073.093421592092;10086.848697269546;10238.02738739826;10861.076808471289;3564.1446052947367;3643.4352675335367;3647.2705458908326;3686.870959516431;3729.5710993235853;84198.57900710519;85296.57351713264;85609.57195214047;85683;86567.13432865654;9478.90521094794;9492.335536512515;9524.476153811469;9568.56941437637;9912.207023438108;22002.88998555029;22171;22366.217182398865;22368;22371.776282237293;7463.328300452985;7483.962580187064;7586.544807311579;7680.5391676499585;7755.844883102306;4110.815013324408;4151.6886233532605;4151.958480415217;4176.436181115571;4205.432266644025;3604.6575575320303;3609.314230296235;3646.4712616670963;3654.214343916071;3659.579148397915;622.4335854372499;650.9674516274167;683.040328338685;690.1890278922347;690.4441924251026;503.87906902343906;576.4811669497402;609.1806520230372;611.0742225528328;622.8754249150188;7900.249476299742;8058.798530036679;8190.754277371689;8280.668773249003;8320.958395207985;473;527.4698927577837;534.5509771791714;573.5669569475103;615.802943058226;3768.679662228741;3856.382978723391;3893.2992061429213;3906.570277269498;4025;93637.51255063899;95126.52436737771;96041;96315;97039.0296097044;62759.74480510456;72949;76622;77299;77745;72595;72676.27323726696;72899.63550182321;73191;73817;7107.360337569644;7644.655990480331;7802.81339474667;7883.960580197062;7914.643841027283;35007.7747278844;41787;45000.54999450094;49212.75393623152;50786.746066269436;68963.65518172376;70810.93783593147;72230.27769722235;72342.1914452143;73041;10955.17836162307;11161.386123763272;11245.662630121109;11428.714282143013;11512.481938312629;11819.468123934616;11896.286222826659;11918.344491053076;11983.520659173535;11999.340036298088;11190.160737944523;11306;11359.204855660024;12298;12381;11062.391568463812;11355.48900299472;11503.471390950657;11531.538738450368;11844.196742222959;11233;11242.325460472397;11320;11476.254043487146;11588.188826782382;8333.416660833684;9314.227226202684;9489.762755931157;9551.046302996583;10106;8832;9661.758456038655;9708.708738737849;9717.9028209717;9795.9020409795 22:46:02 INFO - PROCESS | 1675 | __end_tp_report 22:46:02 INFO - PROCESS | 1675 | __start_cc_report 22:46:02 INFO - PROCESS | 1675 | _x_x_mozilla_cycle_collect,378 22:46:02 INFO - PROCESS | 1675 | __end_cc_report 22:46:02 INFO - PROCESS | 1675 | __startTimestamp1458539162016__endTimestamp 22:46:02 INFO - PROCESS | 1675 | 22:46:02 INFO - PROCESS | 1675 | ------- Summary: start ------- 22:46:02 INFO - PROCESS | 1675 | Number of tests: 6 22:46:02 INFO - PROCESS | 1675 | 22:46:02 INFO - PROCESS | 1675 | [#0] dojo.html Cycles:165 Average:5803.12 Median:6077.85 stddev:643.89 (10.6%) stddev-sans-first:619.59 22:46:02 INFO - PROCESS | 1675 | Values: 3482.4 3510.0 3530.2 3534.4 3566.0 5009.2 5490.6 5768.2 5828.8 5841.1 5682.2 5775.4 5843.0 5865.9 5878.6 5230.1 5265.1 5309.7 5321.5 5386.6 5324.5 5338.9 5412.7 5432.1 5487.0 5225.3 5272.7 5340.9 5341.4 5354.1 3921.6 5256.6 5272.9 5293.7 5297.4 5263.8 5267.2 5280.0 5306.9 5330.7 5562.5 5606.9 5680.7 5771.9 5808.9 5427.5 6298.9 6306.7 6309.4 6316.7 6183.1 6235.1 6241.8 6259.7 6260.7 4987.7 5824.3 5950.9 5964.0 5970.0 6249.7 6285.2 6309.0 6335.6 6344.9 6167.5 6255.1 6275.5 6291.7 6296.1 6147.8 6172.8 6286.5 6300.6 6308.5 6282.4 6291.5 6292.7 6298.3 6299.7 6245.9 6253.5 6310.4 6317.2 6320.3 4882.6 4947.0 4981.9 4996.5 5023.3 4456.1 4465.6 4470.3 4473.4 4480.0 5839.2 5906.6 5923.7 5945.2 5965.6 6196.6 6200.5 6227.6 6232.8 6259.4 5904.9 5917.5 5926.0 5926.4 5983.8 5271.7 5442.6 5464.4 5481.2 5512.2 6339.3 6371.4 6427.5 6447.5 6454.8 6244.1 6259.5 6260.0 6274.2 6276.2 6241.3 6361.7 6380.6 6404.4 6407.7 6139.4 6208.7 6229.2 6242.4 6271.5 6077.8 6232.4 6258.7 6259.2 6272.1 6132.9 6168.0 6236.7 6239.8 6249.6 6144.0 6148.1 6175.7 6210.4 6224.6 5966.9 6032.4 6104.6 6107.1 6117.8 6059.7 6121.5 6186.5 6193.4 6252.7 6020.0 6069.2 6072.5 6089.8 6100.3 22:46:02 INFO - PROCESS | 1675 | 22:46:02 INFO - PROCESS | 1675 | [#1] ext.html Cycles:180 Average:59075.81 Median:39102.62 stddev:119327.33 (305.2%) stddev-sans-first:119580.92 22:46:02 INFO - PROCESS | 1675 | Values: 460.3 571.5 599.1 632.1 640.4 38901.0 39399.8 39505.4 39572.4 39626.8 33627.5 40622.4 41354.2 41404.4 41470.6 9335.6 9469.4 9479.0 9516.2 9563.4 9425.8 9634.2 9650.8 9660.2 9665.6 9624.9 9672.9 9703.4 9731.8 9736.8 9592.7 9664.0 9682.8 9685.3 9696.6 9491.7 9627.0 9631.9 9639.1 9643.8 32997.7 39766.6 39958.0 40094.8 40268.6 3141.6 3278.5 3474.8 3949.9 4116.9 28579.9 28695.7 28746.3 28803.6 28978.7 2667.5 2672.7 2752.1 2760.3 2760.4 336603.3 337501.0 338781.0 340691.0 340779.3 46793.3 47269.5 59984.0 62016.8 62067.4 44856.6 44952.6 45030.5 45124.8 45152.1 16186.4 16313.4 16377.3 16383.3 16440.0 12547.9 12912.7 12975.9 13010.9 13046.7 15272.3 15277.2 15307.7 15339.3 15368.8 5637.8 6073.9 6521.3 6713.0 6716.6 1008.7 1023.8 1033.8 1061.9 1169.2 29982.9 30283.8 30317.2 30977.4 31044.7 990.0 1097.5 1170.3 1190.9 1256.6 14018.3 14982.9 15356.0 15481.0 15898.8 502946.0 505271.0 506484.0 511631.0 511831.0 58435.4 60383.4 61214.7 62012.7 62111.7 1174.4 1370.6 1452.2 1467.8 1497.0 30244.4 30360.5 30364.2 30514.0 31060.4 52957.7 53083.1 53273.7 53344.0 53522.5 479797.0 480427.0 482937.0 485125.0 485896.0 34583.7 34994.6 44991.3 45870.5 47128.8 40642.0 43866.0 44469.9 45152.8 45670.8 33832.7 34794.5 35237.8 35263.3 36059.8 35845.3 35859.5 36510.5 36567.6 36645.3 33887.5 37086.1 37727.0 38872.2 39304.2 31407.7 32103.9 32115.5 32151.7 32221.0 21282.6 24192.6 24669.5 25975.0 26024.6 22:46:02 INFO - PROCESS | 1675 | 22:46:02 INFO - PROCESS | 1675 | [#2] jquery.html Cycles:180 Average:33015.42 Median:13657.21 stddev:99048.03 (725.2%) stddev-sans-first:99295.50 22:46:02 INFO - PROCESS | 1675 | Values: 343.6 365.8 366.8 368.1 373.5 19364.8 19376.6 20260.4 20260.7 20315.5 19529.6 20345.5 20640.5 20712.2 21290.9 5596.6 5890.5 5927.7 5930.1 5933.2 4196.2 5774.0 6363.2 6646.9 6669.9 6512.6 6572.5 6593.5 6596.1 6596.4 6208.6 6340.0 6348.6 6352.2 6370.1 5332.2 5443.2 5512.0 5515.3 5516.9 25019.2 25086.0 25299.7 25716.0 25823.0 2080.5 2139.8 2267.4 2295.2 2529.5 14714.2 14992.9 15082.2 15133.2 15357.2 1667.8 1756.8 1758.2 1814.2 1820.3 98004.0 98121.0 100493.5 101736.0 104131.5 11038.8 11185.2 11206.7 11216.9 11249.0 13363.5 13437.8 13472.9 13523.4 13562.1 8173.3 8198.3 8312.2 8321.4 8384.6 7575.5 8255.7 8302.4 8354.9 8433.9 4089.7 4105.1 4416.8 4473.0 4485.5 1780.6 1823.6 1856.7 1870.9 1874.8 837.7 887.6 894.4 900.2 1003.2 17733.5 19835.0 20123.9 20225.1 20310.3 971.6 975.1 979.4 1024.1 1062.5 10856.0 10920.9 11014.9 11017.0 11022.2 539451.0 575387.0 617829.0 627187.0 639450.0 66833.7 78165.6 94705.1 105540.5 109459.9 1009.3 1023.8 1026.7 1039.7 1044.2 17735.4 17957.3 17999.0 18116.6 18253.3 33616.8 45850.8 46940.5 47808.3 49588.0 67974.0 67974.3 68122.0 68846.3 69072.3 7189.2 7525.4 7669.2 7853.2 7943.3 10701.9 12066.3 12140.0 12532.4 12545.7 10545.9 10668.1 10765.4 10815.9 10863.2 10399.0 10494.4 10556.2 10938.8 11050.7 9163.5 10013.6 10310.4 10684.2 11352.5 7600.2 7658.8 7724.8 7822.5 7960.7 10537.3 10671.8 10684.9 10915.6 10970.8 22:46:02 INFO - PROCESS | 1675 | 22:46:02 INFO - PROCESS | 1675 | [#3] mootools.html Cycles:180 Average:6202.49 Median:5074.22 stddev:3262.70 (64.3%) stddev-sans-first:3253.26 22:46:02 INFO - PROCESS | 1675 | Values: 1568.7 1638.4 1937.8 2010.2 2016.9 7685.5 8515.8 8761.3 8985.1 8991.1 7275.2 8799.3 8895.2 8908.2 8915.3 2115.7 2506.8 2515.7 2528.1 2537.6 2466.2 2535.2 2555.8 2561.1 2562.7 2212.0 2463.0 2497.5 2525.8 2541.1 2486.6 2488.9 2516.2 2529.2 2534.4 2494.6 2507.4 2531.4 2536.2 2537.1 8887.6 8907.2 8918.1 8921.7 9386.8 4367.4 4820.2 5024.9 5444.5 5610.4 3533.9 3546.5 3572.9 3765.8 3793.1 1033.8 1051.7 1053.2 1054.9 1065.2 12186.9 12332.5 12377.9 12382.3 12389.3 4663.6 5056.8 5089.8 5095.2 5178.6 10220.6 10439.1 10450.8 10455.5 10470.3 4492.6 5611.9 5616.7 5674.8 5700.1 5058.6 5119.5 5121.9 5144.5 5158.7 4081.4 4088.6 4134.7 4138.2 4148.7 1257.7 1347.8 1362.1 1374.4 1375.7 1056.5 1167.3 1169.6 1348.6 1438.9 8130.7 8228.7 8276.6 8323.8 8335.0 1124.3 1227.3 1229.3 1241.6 1249.3 6283.7 6320.8 6347.6 6369.2 6392.0 10684.9 10967.3 11017.1 11079.7 11095.8 10609.7 10874.8 10878.4 10904.1 11020.7 8482.5 8532.0 8533.1 8539.1 8593.1 7935.3 8039.2 8074.0 8101.7 8107.2 9425.5 9785.7 9850.3 9864.7 9914.2 9785.3 10065.5 10111.0 10146.9 10208.3 7594.7 7680.5 7693.2 7708.2 7714.7 8441.3 8447.6 8525.3 8528.4 8542.8 7527.8 7665.7 7704.1 7732.3 7778.2 7452.6 7468.4 7514.8 7566.4 7603.7 7971.7 7975.1 8003.3 8072.0 8077.4 7209.4 7260.8 7263.7 7270.6 7305.4 7343.6 7371.0 7373.2 7398.2 7425.7 22:46:02 INFO - PROCESS | 1675 | 22:46:02 INFO - PROCESS | 1675 | [#4] prototype.html Cycles:180 Average:5848.44 Median:6724.74 stddev:1902.89 (28.3%) stddev-sans-first:1862.66 22:46:02 INFO - PROCESS | 1675 | Values: 333.1 333.8 336.2 341.1 342.2 6787.7 6801.5 6814.6 6817.1 6850.5 6729.1 6730.3 6736.8 6747.8 6759.4 4123.9 4773.6 4879.5 5004.7 5022.4 4454.6 4540.7 4658.0 4949.9 5057.6 3885.6 4343.1 4731.4 4965.3 4998.2 5000.6 5000.7 5013.3 5030.0 5099.8 3319.7 3651.5 4219.2 4317.5 4318.7 4966.0 6517.0 6560.3 6562.4 6591.3 5711.7 5720.4 5738.8 5750.0 5756.1 6228.7 7189.7 7247.3 7267.9 7283.5 4659.5 4662.9 4666.5 4672.9 4702.3 7584.9 7635.8 7641.8 7647.8 7677.1 4517.5 4698.6 4713.0 4726.2 4732.4 4777.9 4802.1 4805.8 4810.6 4810.8 5741.7 5756.5 5770.0 5785.3 5792.2 7223.8 7233.1 7248.6 7251.0 7261.6 1492.3 1581.6 1656.4 1667.3 1687.1 1030.8 1068.3 1073.4 1086.3 1086.5 6618.8 6712.5 6729.4 6745.2 6765.9 7484.4 7487.9 7492.6 7498.1 7522.2 5304.7 6580.4 6740.2 6804.5 6826.1 3948.1 3978.7 4002.9 4007.6 4009.0 6933.7 7403.9 7872.5 7901.3 7922.3 7528.3 7784.5 7837.5 7838.0 7838.5 6406.3 6488.9 7773.3 7924.4 7946.0 6124.4 7454.4 7510.1 7523.8 7547.9 6709.1 7416.4 7420.3 7435.2 7439.5 6720.4 7581.8 7869.5 7899.1 7904.4 4691.3 4718.0 4721.9 4727.7 4752.1 5694.9 6839.7 7493.3 7541.0 7562.7 7230.2 7243.1 7260.6 7272.5 7313.2 6910.1 7230.5 7241.8 7260.6 7262.2 7040.5 7074.6 7076.4 7097.1 7109.5 7237.9 7240.8 7252.3 7263.6 7291.2 7071.9 7086.1 7103.5 7104.1 7134.3 22:46:02 INFO - PROCESS | 1675 | 22:46:02 INFO - PROCESS | 1675 | [#5] yui.html Cycles:180 Average:18471.55 Median:622.65 stddev:26241.05 (4214.4%) stddev-sans-first:26280.65 22:46:02 INFO - PROCESS | 1675 | Values: 678.0 690.3 718.1 726.0 727.2 15029.9 15143.4 15190.5 15278.5 15313.4 14091.2 14114.1 14165.2 14211.9 14252.6 694.5 704.3 757.8 821.2 931.3 862.8 900.4 905.9 915.5 916.2 954.5 965.4 976.3 981.5 990.4 959.5 967.1 968.5 972.8 972.9 710.3 720.7 728.1 730.9 732.3 14653.9 14826.0 14837.1 14862.3 14871.3 12996.6 13002.6 13017.7 13029.5 13063.9 10006.3 10073.1 10086.8 10238.0 10861.1 3564.1 3643.4 3647.3 3686.9 3729.6 84198.6 85296.6 85609.6 85683.0 86567.1 9478.9 9492.3 9524.5 9568.6 9912.2 22002.9 22171.0 22366.2 22368.0 22371.8 7463.3 7484.0 7586.5 7680.5 7755.8 4110.8 4151.7 4152.0 4176.4 4205.4 3604.7 3609.3 3646.5 3654.2 3659.6 622.4 651.0 683.0 690.2 690.4 503.9 576.5 609.2 611.1 622.9 7900.2 8058.8 8190.8 8280.7 8321.0 473.0 527.5 534.6 573.6 615.8 3768.7 3856.4 3893.3 3906.6 4025.0 93637.5 95126.5 96041.0 96315.0 97039.0 62759.7 72949.0 76622.0 77299.0 77745.0 72595.0 72676.3 72899.6 73191.0 73817.0 7107.4 7644.7 7802.8 7884.0 7914.6 35007.8 41787.0 45000.5 49212.8 50786.7 68963.7 70810.9 72230.3 72342.2 73041.0 10955.2 11161.4 11245.7 11428.7 11512.5 11819.5 11896.3 11918.3 11983.5 11999.3 11190.2 11306.0 11359.2 12298.0 12381.0 11062.4 11355.5 11503.5 11531.5 11844.2 11233.0 11242.3 11320.0 11476.3 11588.2 8333.4 9314.2 9489.8 9551.0 10106.0 8832.0 9661.8 9708.7 9717.9 9795.9 22:46:02 INFO - PROCESS | 1675 | -------- Summary: end -------- 22:46:02 INFO - PROCESS | 1675 | 22:46:02 INFO - TEST-INFO | 1675: exit 0 22:46:02 INFO - TEST-OK | dromaeo_css | took 1113210ms 22:46:02 INFO - TEST-START | kraken 22:46:02 INFO - operating with platform_type : mac_ 22:46:02 INFO - Initialising browser for kraken test... 22:46:02 INFO - TEST-INFO | started process 1685 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/tmpkXKD8C/profile http://localhost:49278/getInfo.html) 22:46:05 INFO - PROCESS | 1685 | JavaScript error: jar:file:///builds/slave/test/build/application/Nightly.app/Contents/Resources/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 22:46:05 INFO - PROCESS | 1685 | __metrics Screen width/height:1600/1200 22:46:05 INFO - PROCESS | 1685 | colorDepth:24 22:46:05 INFO - PROCESS | 1685 | Browser inner width/height: 1024/689 22:46:05 INFO - PROCESS | 1685 | __metrics 22:46:05 ERROR - PROCESS | 1685 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 22:46:06 INFO - TEST-INFO | 1685: exit 0 22:46:06 INFO - Browser initialized. 22:46:06 INFO - Running cycle 1/1 for kraken test... 22:46:06 INFO - TEST-INFO | started process 1688 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/T/tmpkXKD8C/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 22:46:18 INFO - PROCESS | 1688 | RSS: Main: 257847296 22:46:18 INFO - PROCESS | 1688 | 22:46:21 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49278/tests/kraken/driver.html?testName=audio-beat-detection) 22:46:21 INFO - PROCESS | 1688 | RSS: Main: 269406208 22:46:21 INFO - PROCESS | 1688 | 22:46:24 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49278/tests/kraken/driver.html?testName=audio-dft) 22:46:25 INFO - PROCESS | 1688 | RSS: Main: 277614592 22:46:25 INFO - PROCESS | 1688 | 22:46:28 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49278/tests/kraken/driver.html?testName=audio-fft) 22:46:29 INFO - PROCESS | 1688 | RSS: Main: 282726400 22:46:29 INFO - PROCESS | 1688 | 22:46:31 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49278/tests/kraken/driver.html?testName=audio-oscillator) 22:46:31 INFO - PROCESS | 1688 | RSS: Main: 283860992 22:46:31 INFO - PROCESS | 1688 | 22:46:33 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49278/tests/kraken/driver.html?testName=imaging-gaussian-blur) 22:46:34 INFO - PROCESS | 1688 | RSS: Main: 284696576 22:46:34 INFO - PROCESS | 1688 | 22:46:37 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49278/tests/kraken/driver.html?testName=imaging-darkroom) 22:46:37 INFO - PROCESS | 1688 | RSS: Main: 284368896 22:46:37 INFO - PROCESS | 1688 | 22:46:40 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49278/tests/kraken/driver.html?testName=imaging-desaturate) 22:46:41 INFO - PROCESS | 1688 | RSS: Main: 284278784 22:46:41 INFO - PROCESS | 1688 | 22:46:44 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49278/tests/kraken/driver.html?testName=json-parse-financial) 22:46:44 INFO - PROCESS | 1688 | RSS: Main: 284659712 22:46:44 INFO - PROCESS | 1688 | 22:46:46 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49278/tests/kraken/driver.html?testName=json-stringify-tinderbox) 22:46:47 INFO - PROCESS | 1688 | RSS: Main: 285429760 22:46:47 INFO - PROCESS | 1688 | 22:46:49 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49278/tests/kraken/driver.html?testName=stanford-crypto-aes) 22:46:49 INFO - PROCESS | 1688 | RSS: Main: 285589504 22:46:49 INFO - PROCESS | 1688 | 22:46:52 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49278/tests/kraken/driver.html?testName=stanford-crypto-ccm) 22:46:52 INFO - PROCESS | 1688 | RSS: Main: 285904896 22:46:52 INFO - PROCESS | 1688 | 22:46:55 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49278/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 22:46:55 INFO - PROCESS | 1688 | RSS: Main: 286101504 22:46:55 INFO - PROCESS | 1688 | 22:46:58 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49278/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 22:46:58 INFO - PROCESS | 1688 | RSS: Main: 284815360 22:46:58 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | Cycle 1(1): loaded http://localhost:49278/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49278/tests/kraken/driver.html?testName=ai-astar) 22:47:00 INFO - PROCESS | 1688 | RSS: Main: 285859840 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | __start_tp_report 22:47:00 INFO - PROCESS | 1688 | _x_x_mozilla_page_load 22:47:00 INFO - PROCESS | 1688 | _x_x_mozilla_page_load_details 22:47:00 INFO - PROCESS | 1688 | |i|pagename|runs| 22:47:00 INFO - PROCESS | 1688 | |0;ai-astar;115;87;167;97;167;180;163;114;113;116 22:47:00 INFO - PROCESS | 1688 | |1;audio-beat-detection;151;129;145;160;124;158;171;124;162;125 22:47:00 INFO - PROCESS | 1688 | |2;audio-dft;196;277;259;229;203;201;200;228;203;198 22:47:00 INFO - PROCESS | 1688 | |3;audio-fft;70;71;74;113;59;57;58;59;118;56 22:47:00 INFO - PROCESS | 1688 | |4;audio-oscillator;78;80;126;80;81;81;121;84;79;120 22:47:00 INFO - PROCESS | 1688 | |5;imaging-gaussian-blur;88;89;87;85;88;85;90;86;106;127 22:47:00 INFO - PROCESS | 1688 | |6;imaging-darkroom;145;90;146;144;95;117;147;95;94;95 22:47:00 INFO - PROCESS | 1688 | |7;imaging-desaturate;138;145;91;99;91;91;92;90;90;142 22:47:00 INFO - PROCESS | 1688 | |8;json-parse-financial;46;53;59;83;66;57;56;66;59;57 22:47:00 INFO - PROCESS | 1688 | |9;json-stringify-tinderbox;64;69;69;70;81;82;99;99;89;69 22:47:00 INFO - PROCESS | 1688 | |10;stanford-crypto-aes;86;84;111;108;110;106;87;83;105;111 22:47:00 INFO - PROCESS | 1688 | |11;stanford-crypto-ccm;121;122;129;123;123;160;126;118;129;139 22:47:00 INFO - PROCESS | 1688 | |12;stanford-crypto-pbkdf2;129;139;143;141;143;131;141;141;143;129 22:47:00 INFO - PROCESS | 1688 | |13;stanford-crypto-sha256-iterative;71;69;67;67;71;69;66;71;70;69 22:47:00 INFO - PROCESS | 1688 | __end_tp_report 22:47:00 INFO - PROCESS | 1688 | __start_cc_report 22:47:00 INFO - PROCESS | 1688 | _x_x_mozilla_cycle_collect,965 22:47:00 INFO - PROCESS | 1688 | __end_cc_report 22:47:00 INFO - PROCESS | 1688 | __startTimestamp1458539220867__endTimestamp 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | ------- Summary: start ------- 22:47:00 INFO - PROCESS | 1688 | Number of tests: 14 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#0] ai-astar Cycles:10 Average:131.90 Median:167.00 stddev:33.66 (20.2%) stddev-sans-first:35.14 22:47:00 INFO - PROCESS | 1688 | Values: 115.0 87.0 167.0 97.0 167.0 180.0 163.0 114.0 113.0 116.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#1] audio-beat-detection Cycles:10 Average:144.90 Median:154.50 stddev:18.05 (11.7%) stddev-sans-first:19.01 22:47:00 INFO - PROCESS | 1688 | Values: 151.0 129.0 145.0 160.0 124.0 158.0 171.0 124.0 162.0 125.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#2] audio-dft Cycles:10 Average:219.40 Median:215.50 stddev:28.50 (13.2%) stddev-sans-first:28.94 22:47:00 INFO - PROCESS | 1688 | Values: 196.0 277.0 259.0 229.0 203.0 201.0 200.0 228.0 203.0 198.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#3] audio-fft Cycles:10 Average:73.50 Median:59.00 stddev:23.09 (39.1%) stddev-sans-first:24.46 22:47:00 INFO - PROCESS | 1688 | Values: 70.0 71.0 74.0 113.0 59.0 57.0 58.0 59.0 118.0 56.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#4] audio-oscillator Cycles:10 Average:93.00 Median:80.00 stddev:20.36 (25.4%) stddev-sans-first:20.86 22:47:00 INFO - PROCESS | 1688 | Values: 78.0 80.0 126.0 80.0 81.0 81.0 121.0 84.0 79.0 120.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#5] imaging-gaussian-blur Cycles:10 Average:93.10 Median:87.50 stddev:13.39 (15.3%) stddev-sans-first:14.07 22:47:00 INFO - PROCESS | 1688 | Values: 88.0 89.0 87.0 85.0 88.0 85.0 90.0 86.0 106.0 127.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#6] imaging-darkroom Cycles:10 Average:116.80 Median:92.00 stddev:25.74 (28.0%) stddev-sans-first:25.20 22:47:00 INFO - PROCESS | 1688 | Values: 145.0 90.0 146.0 144.0 95.0 117.0 147.0 95.0 94.0 95.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#7] imaging-desaturate Cycles:10 Average:106.90 Median:91.00 stddev:24.19 (26.6%) stddev-sans-first:22.89 22:47:00 INFO - PROCESS | 1688 | Values: 138.0 145.0 91.0 99.0 91.0 91.0 92.0 90.0 90.0 142.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#8] json-parse-financial Cycles:10 Average:60.20 Median:59.00 stddev:9.90 (16.8%) stddev-sans-first:9.07 22:47:00 INFO - PROCESS | 1688 | Values: 46.0 53.0 59.0 83.0 66.0 57.0 56.0 66.0 59.0 57.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#9] json-stringify-tinderbox Cycles:10 Average:79.10 Median:81.50 stddev:12.99 (15.9%) stddev-sans-first:12.58 22:47:00 INFO - PROCESS | 1688 | Values: 64.0 69.0 69.0 70.0 81.0 82.0 99.0 99.0 89.0 69.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#10] stanford-crypto-aes Cycles:10 Average:99.10 Median:97.00 stddev:12.33 (12.7%) stddev-sans-first:12.14 22:47:00 INFO - PROCESS | 1688 | Values: 86.0 84.0 111.0 108.0 110.0 106.0 87.0 83.0 105.0 111.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#11] stanford-crypto-ccm Cycles:10 Average:129.00 Median:127.50 stddev:12.36 (9.7%) stddev-sans-first:12.77 22:47:00 INFO - PROCESS | 1688 | Values: 121.0 122.0 129.0 123.0 123.0 160.0 126.0 118.0 129.0 139.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:138.00 Median:141.00 stddev:5.91 (4.2%) stddev-sans-first:5.29 22:47:00 INFO - PROCESS | 1688 | Values: 129.0 139.0 143.0 141.0 143.0 131.0 141.0 141.0 143.0 129.0 22:47:00 INFO - PROCESS | 1688 | 22:47:00 INFO - PROCESS | 1688 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.00 Median:69.50 stddev:1.83 (2.6%) stddev-sans-first:1.79 22:47:00 INFO - PROCESS | 1688 | Values: 71.0 69.0 67.0 67.0 71.0 69.0 66.0 71.0 70.0 69.0 22:47:00 INFO - PROCESS | 1688 | -------- Summary: end -------- 22:47:00 INFO - PROCESS | 1688 | 22:47:01 INFO - TEST-INFO | 1688: exit 0 22:47:01 INFO - TEST-OK | kraken | took 59018ms 22:47:01 INFO - SUITE-END | took 1172s 22:47:02 INFO - Completed test suite (00:19:32) 22:47:02 INFO - javascript benchmark 22:47:02 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3482.373172828891, 3509.9649003509967, 3530.240998185391, 3534.3991521441367, 3565.9821700891493, 5009.248612708096, 5490.6431081979645, 5768.19245305657, 5828.825135245944, 5841.0946303323, 5682.17608446775, 5775.422457754223, 5843.035899076647, 5865.941340586593, 5878.617889837157, 5230.1108811502045, 5265.078611243036, 5309.707966061865, 5321.494458026481, 5386.649867758602, 5324.467553244684, 5338.893222135555, 5412.729363531827, 5432.103702889039, 5487.0, 5225.294585230983, 5272.657277276965, 5340.866478338034, 5341.359036915556, 5354.089804733185, 3921.6470517653547, 5256.579473642099, 5272.894542109175, 5293.7353132343615, 5297.417284098746, 5263.842084737464, 5267.209918512254, 5280.0, 5306.867328316785, 5330.653507521999, 5562.527185189264, 5606.887862242773, 5680.687562184078, 5771.942280577183, 5808.88382232353, 5427.45725427458, 6298.874022519524, 6306.716197771111, 6309.400606942333, 6316.747330106836, 6183.103499775983, 6235.064740288947, 6241.812745617639, 6259.749610015594, 6260.686965651699, 4987.650864439527, 5824.301083869963, 5950.880982380371, 5963.970180149072, 5970.044792833126, 6249.6562689052535, 6285.151504546919, 6309.0, 6335.588186767845, 6344.936550634527, 6167.537434692416, 6255.12428260044, 6275.466585340298, 6291.653959032297, 6296.087067375205, 6147.801178770186, 6172.845678857974, 6286.465650419674, 6300.59046161998, 6308.495320374359, 6282.371762823681, 6291.5281353898645, 6292.653904035231, 6298.338674439118, 6299.6850157491945, 6245.937540624535, 6253.499720022387, 6310.368963103653, 6317.210348706411, 6320.27316858558, 4882.5605695486865, 4946.975265123723, 4981.850544483671, 4996.475370086161, 5023.271625614266, 4456.131054444352, 4465.620422264079, 4470.262406702857, 4473.367220964325, 4479.955200447954, 5839.153322768175, 5906.5570082244, 5923.674197919156, 5945.16767652529, 5965.612235204698, 6196.597221180609, 6200.503959683305, 6227.564070515021, 6232.75068997235, 6259.374062593795, 5904.917120483371, 5917.467427931507, 5925.970370148121, 5926.436988486087, 5983.790567330123, 5271.710055946883, 5442.6462279951675, 5464.426235245322, 5481.177823326533, 5512.200730893998, 6339.302676705559, 6371.39471750183, 6427.517936154713, 6447.516436267392, 6454.838629034311, 6244.125822384961, 6259.467945224706, 6259.96870015647, 6274.247090349188, 6276.246850377984, 6241.282252541016, 6361.650109243851, 6380.585261957958, 6404.423601875667, 6407.679616019087, 6139.400144844221, 6208.689565521796, 6229.190205273286, 6242.438180563771, 6271.498280137487, 6077.848053798691, 6232.376762323732, 6258.749650014131, 6259.1550140730415, 6272.09054687077, 6132.938670613236, 6168.0, 6236.65698386575, 6239.78160764371, 6249.625022498664, 6143.986242269975, 6148.139260503623, 6175.6912154393, 6210.4100110489435, 6224.564280500322, 5966.850828729316, 6032.366601506778, 6104.603200791934, 6107.144999700135, 6117.785877494266, 6059.697015149137, 6121.5139442231075, 6186.4741496973265, 6193.406025425623, 6252.656103914328, 6019.976603977422, 6069.180660610761, 6072.453479186895, 6089.786857459968, 6100.2984656763265], "unit": "score", "name": "dojo.html", "value": 5763.648098341246}, {"lowerIsBetter": false, "replicates": [460.3417113527654, 571.5085026876885, 599.0684485624852, 632.1371328137094, 640.420419520334, 38901.02747431312, 39399.803000985026, 39505.4074188887, 39572.40641390382, 39626.8018659907, 33627.495587566205, 40622.39066414006, 41354.172916541655, 41404.37893431601, 41470.58529414705, 9335.62657493701, 9469.384490008128, 9478.952605236964, 9516.23870090391, 9563.426194428323, 9425.76435589109, 9634.181094606933, 9650.806983860319, 9660.178884794766, 9665.613375464973, 9624.903750962505, 9672.854907176397, 9703.417794932291, 9731.805363892718, 9736.805263894717, 9592.712218633453, 9663.985281545407, 9682.75793105178, 9685.273604479622, 9696.563654635524, 9491.66779162733, 9626.951865240699, 9631.880986183029, 9639.132478076937, 9643.807123857554, 32997.6700232997, 39766.60233397658, 39958.0, 40094.7924166066, 40268.597314026774, 3141.6387115481784, 3278.49183376577, 3474.8262586870555, 3949.940750888739, 4116.91766164678, 28579.857100714362, 28695.713042869513, 28746.281342966384, 28803.56794648082, 28978.71021289781, 2667.5198464276423, 2672.719364466742, 2752.0505425628126, 2760.2961244882426, 2760.3513174403997, 336603.316983416, 337501.0, 338781.0, 340691.0, 340779.2961035204, 46793.29810052852, 47269.527304726515, 59984.0, 62016.75966480645, 62067.37932620706, 44856.55143448589, 44952.55047449549, 45030.549694503294, 45124.77437612791, 45152.096958060654, 16186.352545898033, 16313.429029983894, 16377.344906203618, 16383.262753176135, 16440.013599184087, 12547.874521254671, 12912.677183070498, 12975.870241297465, 13010.894074003816, 13046.739065218831, 15272.31274592646, 15277.236138193268, 15307.693846123015, 15339.309731061905, 15368.846311536965, 5637.774489020393, 6073.937061014393, 6521.347865213441, 6713.0, 6716.5634233774645, 1008.7478130467383, 1023.7798873242289, 1033.8007910823408, 1061.936283822973, 1169.2107827216594, 29982.850085749433, 30283.848580756956, 30317.242068948013, 30977.380452390826, 31044.68955310418, 990.0446069542926, 1097.4951522299673, 1170.3329102411715, 1190.9285442873456, 1256.5978886756334, 14018.299085045706, 14982.925085374503, 15356.0, 15480.993735407163, 15898.76151857723, 502946.0, 505271.0, 506484.0, 511631.0, 511831.0, 58435.403397558046, 60383.396166037775, 61214.69392653097, 62012.68993655003, 62111.689441553404, 1174.3775798826637, 1370.6025252676811, 1452.1867754057762, 1467.7504824179914, 1497.0194522587722, 30244.395112097194, 30360.54459183158, 30364.223236167323, 30514.0, 31060.378792424475, 52957.7352113237, 53083.14209002666, 53273.7336313316, 53344.0, 53522.46477535175, 479797.0, 480427.0, 482937.0, 485125.0, 485896.0, 34583.65416345804, 34994.60021599108, 44991.32513012373, 45870.54129458663, 47128.764356178, 40642.0, 43866.0, 44469.88825279394, 45152.77423612861, 45670.771646141555, 33832.66167338393, 34794.478082829286, 35237.82381088078, 35263.29473410466, 36059.81970090133, 35845.28309433849, 35859.46210806788, 36510.4523432154, 36567.63432365749, 36645.26709465742, 33887.49168762421, 37086.072848179014, 37727.0, 38872.222555548164, 39304.213915722095, 31407.685923140478, 32103.876364327138, 32115.518267225543, 32151.67848321487, 32221.0, 21282.57434851325, 24192.637110443004, 24669.50660986734, 25975.0, 26024.609630855175], "unit": "score", "name": "ext.html", "value": 19269.053745208283}, {"lowerIsBetter": false, "replicates": [343.62544826139504, 365.8280608114187, 366.8000939487979, 368.13121034358926, 373.48086160237256, 19364.806351936477, 19376.612467750656, 20260.39218823434, 20260.696089558667, 20315.49211269719, 19529.609407811837, 20345.49136271594, 20640.48398790031, 20712.171513139496, 21290.89354553229, 5596.58025648076, 5890.499307558863, 5927.733252003649, 5930.051191809312, 5933.199018132562, 4196.244675958326, 5773.971130144343, 6363.236411630611, 6646.900296495556, 6669.933300666979, 6512.576682515645, 6572.507061970347, 6593.53845230834, 6596.076549283104, 6596.373344532286, 6208.627482351051, 6340.0, 6348.555601107924, 6352.174217351738, 6370.140031095789, 5332.226827110087, 5443.2107344435235, 5512.0, 5515.283013208297, 5516.862078448031, 25019.249422517354, 25085.996560137573, 25299.735013249447, 25716.042655094716, 25822.967081316725, 2080.5006798368436, 2139.775323591032, 2267.444476103365, 2295.1622657729977, 2529.468811549577, 14714.225782607835, 14992.850071499364, 15082.24588770557, 15133.243337833175, 15357.232138393036, 1667.816540180579, 1756.8331008554294, 1758.2175931710394, 1814.165483877418, 1820.2627935686069, 98004.0, 98121.0, 100493.4975325126, 101736.0, 104131.47934260356, 11038.834417483744, 11185.217034807649, 11206.719832004264, 11216.878312168717, 11249.0, 13363.53227637028, 13437.798433023512, 13472.86527134716, 13523.391447384694, 13562.05065645415, 8173.346132309401, 8198.344132469389, 8312.168783121639, 8321.417500774887, 8384.580770961427, 7575.507592006612, 8255.669773209005, 8302.418830681914, 8354.916450835413, 8433.915660843313, 4089.6932730045364, 4105.137921036616, 4416.779161041935, 4472.955270447319, 4485.506594274627, 1780.5993651428585, 1823.6170404214997, 1856.7029275316154, 1870.9345172918881, 1874.7937726850037, 837.6942416018231, 887.6360692116331, 894.4320356573622, 900.2392977933636, 1003.2074661017714, 17733.46799596014, 19835.0, 20123.899380503295, 20225.089870955842, 20310.289139880035, 971.6259240192577, 975.068809287129, 979.3829887171037, 1024.0987930621154, 1062.4581463453694, 10856.0, 10920.890791091988, 11014.944925275322, 11017.0, 11022.228444009002, 539451.0, 575387.0, 617829.0, 627187.0, 639450.0, 66833.66583167053, 78165.60917195491, 94705.05294946962, 105540.47229763801, 109459.90540094656, 1009.333839665817, 1023.7952409518126, 1026.6817286641165, 1039.740064983754, 1044.1751016696724, 17735.37926172578, 17957.281708731505, 17999.010054446608, 18116.591035745478, 18253.269869205615, 33616.83191584027, 45850.77074614605, 46940.53059469361, 47808.282875756195, 49588.0, 67974.0, 67974.32025679878, 68122.0, 68846.311536884, 69072.30927690859, 7189.2451292615615, 7525.435592330707, 7669.156392796899, 7853.175416581176, 7943.33190030077, 10701.892981070401, 12066.336351500751, 12140.0, 12532.436040378023, 12545.749085018431, 10545.894541054799, 10668.14543928522, 10765.3540787553, 10815.893960653155, 10863.239573229797, 10399.0, 10494.370337779757, 10556.155507559222, 10938.835917461403, 11050.723731906444, 9163.541822908961, 10013.648157498936, 10310.43292618913, 10684.198685098494, 11352.54589816398, 7600.239976002355, 7658.8085297868, 7724.806879828049, 7822.530648161129, 7960.721374751856, 10537.26239163282, 10671.786564268827, 10684.946575267384, 10915.617953371593, 10970.780584388427], "unit": "score", "name": "jquery.html", "value": 9322.226500702085}, {"lowerIsBetter": false, "replicates": [1568.6784209237107, 1638.3937942961106, 1937.7577802774645, 2010.2260629657587, 2016.8789872607654, 7685.50044247125, 8515.829683406344, 8761.25529330007, 8985.10148985102, 8991.055939126396, 7275.236100209481, 8799.34004949628, 8895.154960278764, 8908.198262156404, 8915.331350148748, 2115.6720708290163, 2506.8119891008155, 2515.748425157488, 2528.115159694111, 2537.6320433537126, 2466.2056035621836, 2535.1887396033276, 2555.7699807017366, 2561.129216066546, 2562.7309132541095, 2211.9889400552975, 2462.9753702462926, 2497.463045445229, 2525.8105642076825, 2541.07250853439, 2486.5772818620876, 2488.850668959868, 2516.207394670691, 2529.1527338341584, 2534.4297533055005, 2494.6382774497597, 2507.4232926426844, 2531.4430825218424, 2536.239128261514, 2537.0612873236837, 8887.644494220223, 8907.198352148338, 8918.063603321623, 8921.732348029569, 9386.812263754686, 4367.366731823868, 4820.180569303192, 5024.949750502485, 5444.482774136451, 5610.354809196954, 3533.9116522086897, 3546.5389499365174, 3572.8928132156075, 3765.755225910307, 3793.0896584819443, 1033.762234686019, 1051.733514276735, 1053.227183386602, 1054.9419781911993, 1065.1957771882257, 12186.939065304618, 12332.506699732, 12377.876221237853, 12382.31897245651, 12389.318587477776, 4663.603593694574, 5056.848294551096, 5089.821856235014, 5095.210242412432, 5178.585713142939, 10220.6422775204, 10439.112675422522, 10450.843237351446, 10455.477226138815, 10470.319429237075, 4492.595666389975, 5611.9438805612235, 5616.719164041781, 5674.77300907959, 5700.116481945305, 5058.620603454756, 5119.513646203679, 5121.897562048738, 5144.459831717691, 5158.664686795421, 4081.449049361283, 4088.5707000765087, 4134.669226461876, 4138.193052354822, 4148.668106551469, 1257.654145110102, 1347.764141275273, 1362.087401441037, 1374.4021350712471, 1375.7386096641605, 1056.5140035583718, 1167.3171194851107, 1169.590643274847, 1348.615644541301, 1438.8633079857398, 8130.674773009132, 8228.711995080144, 8276.627551760064, 8323.750287491384, 8335.0, 1124.3366413815888, 1227.3372378915285, 1229.299299399334, 1241.6461308527028, 1249.331607589935, 6283.6858157091965, 6320.841978950563, 6347.619142851351, 6369.172007638977, 6392.041193820871, 10684.893151068545, 10967.341959482457, 11017.11863050954, 11079.72300692489, 11095.778084438267, 10609.681709548726, 10874.782504350027, 10878.40168790724, 10904.07315378186, 11020.669379918616, 8482.533460659599, 8531.976162860372, 8533.146685331418, 8539.14608539141, 8593.097724738938, 7935.285824275843, 8039.196080391914, 8073.990751156105, 8101.716439924574, 8107.1892810718455, 9425.481598512148, 9785.657501987682, 9850.261230407605, 9864.704058878246, 9914.157296629868, 9785.266105042008, 10065.547050382604, 10111.03945125212, 10146.883842777435, 10208.285420020824, 7594.658240379306, 7680.462367634212, 7693.153753087044, 7708.152103268524, 7714.652840622298, 8441.28249098809, 8447.619857106567, 8525.275351594935, 8528.360372971927, 8542.78643033929, 7527.8118047049265, 7665.6933722650465, 7704.114026886979, 7732.265434783687, 7778.183290754389, 7452.627368631655, 7468.439867009887, 7514.774556763306, 7566.394688425023, 7603.7338693145475, 7971.681132754625, 7975.082865470546, 8003.319717823817, 8072.0, 8077.434579579373, 7209.387202087882, 7260.782176534713, 7263.673134708845, 7270.600116993616, 7305.379042781211, 7343.632818359168, 7371.0, 7373.188949215475, 7398.2231865655485, 7425.665845037094], "unit": "score", "name": "mootools.html", "value": 5063.475194158618}, {"lowerIsBetter": false, "replicates": [333.12886801015344, 333.76636354551806, 336.2484846368368, 341.1182094286268, 342.20778896853784, 6787.694553745081, 6801.489888258382, 6814.5911245325315, 6817.147856517935, 6850.451963842893, 6729.125213722222, 6730.293319201487, 6736.831579210522, 6747.831304217397, 6759.357861003209, 4123.865936867371, 4773.618110551165, 4879.487653796354, 5004.724740139291, 5022.397312322526, 4454.641334393009, 4540.704854184468, 4657.953420465786, 4949.925751113737, 5057.620678449112, 3885.5531613864346, 4343.087951530182, 4731.408573928259, 4965.3048573199785, 4998.225275082368, 5000.599952003831, 5000.749962501878, 5013.298138260647, 5030.0, 5099.821506247301, 3319.668033196685, 3651.452282157671, 4219.156168766228, 4317.4819021717285, 4318.69769116162, 4965.950340496585, 6516.967415162894, 6560.278369379364, 6562.409383155491, 6591.274959754423, 5711.714414279311, 5720.427957204288, 5738.8278351649515, 5749.965006298865, 5756.136579513065, 6228.657423841687, 7189.676464559107, 7247.275272472711, 7267.854642907165, 7283.4537409694485, 4659.510751371091, 4662.860114196579, 4666.53334666534, 4672.929906051412, 4702.3416721659, 7584.886226706604, 7635.809104772369, 7641.847163056764, 7647.770566882947, 7677.078750549914, 4517.480489743722, 4698.624110071186, 4712.976435117803, 4726.220173671374, 4732.384789977281, 4777.880552986134, 4802.111609352281, 4805.8077676892535, 4810.5670489655395, 4810.831620893322, 5741.655500669973, 5756.510696590753, 5770.047942089592, 5785.30576330843, 5792.189093526909, 7223.819404514929, 7233.095863017123, 7248.565086094851, 7251.0, 7261.636918154071, 1492.2837038221714, 1581.5808810665183, 1656.3705791799039, 1667.316400275881, 1687.0552490605055, 1030.7783826477344, 1068.3269540189785, 1073.4364458659265, 1086.28305318491, 1086.4893500054961, 6618.834529136714, 6712.463002959751, 6729.360710732472, 6745.190577130776, 6765.898511522331, 7484.438667099989, 7487.850242995219, 7492.587907665022, 7498.100227972569, 7522.247775222434, 5304.708241046779, 6580.374864387875, 6740.191177058784, 6804.455643548505, 6826.146731658543, 3948.1314110895555, 3978.701597380208, 4002.899927501836, 4007.6393124618926, 4009.0177906413114, 6933.682600305926, 7403.888941665771, 7872.527648341003, 7901.288884000468, 7922.326602238759, 7528.322450979438, 7784.532928024337, 7837.529748215125, 7838.0, 7838.529688218725, 6406.327335629691, 6488.902666460007, 7773.339266162439, 7924.366050715929, 7946.04647442299, 6124.418180272867, 7454.440916931143, 7510.098788145458, 7523.774286771406, 7547.886781698169, 6709.127813384229, 7416.4066874648815, 7420.295071968154, 7435.219301973431, 7439.51643143194, 6720.361565651256, 7581.810454738676, 7869.5278283300895, 7899.09160446556, 7904.446688731734, 4691.319758634911, 4717.976410117927, 4721.929171062506, 4727.692699974491, 4752.144613969519, 5694.914576281442, 6839.692213850488, 7493.250674932463, 7541.0, 7562.697492100255, 7230.240824713329, 7243.0946131733535, 7260.564366137837, 7272.454565907472, 7313.158986716596, 6910.136232970879, 7230.530015548972, 7241.782746517613, 7260.600666963368, 7262.201157872524, 7040.471964602778, 7074.610896400747, 7076.398506127037, 7097.112860892388, 7109.537880037781, 7237.855242895007, 7240.818979525343, 7252.2747725229165, 7263.636818159177, 7291.234420385783, 7071.929280707127, 7086.149662040588, 7103.502754807114, 7104.076470058859, 7134.32223938725], "unit": "score", "name": "prototype.html", "value": 5214.433955211045}, {"lowerIsBetter": false, "replicates": [678.0, 690.3476214976846, 718.0880282041807, 726.0162479839817, 727.2073439950453, 15029.924850375746, 15143.394264229417, 15190.468333608325, 15278.46525371611, 15313.38746450142, 14091.224982625952, 14114.082584631991, 14165.220912849789, 14211.857881421183, 14252.572422827307, 694.503430047516, 704.2781149321935, 757.8181236503227, 821.1829229916212, 931.3015238571072, 862.7670528957209, 900.3562452846213, 905.8641203819413, 915.4781774388601, 916.1708653668408, 954.4511905654276, 965.4110992294694, 976.2726768557435, 981.4847205217283, 990.4107056301489, 959.4627008874983, 967.1440774914181, 968.5157421289356, 972.8248915195262, 972.868662730533, 710.2506855267691, 720.7117153138734, 728.0571659700647, 730.8611363840853, 732.3445516262968, 14653.926730366387, 14826.036307639968, 14837.109773413522, 14862.331195096247, 14871.33079011447, 12996.610101696964, 13002.609921702364, 13017.739645207137, 13029.459255445192, 13063.86936130636, 10006.349587276804, 10073.093421592092, 10086.848697269546, 10238.02738739826, 10861.076808471289, 3564.1446052947367, 3643.4352675335367, 3647.2705458908326, 3686.870959516431, 3729.5710993235853, 84198.57900710519, 85296.57351713264, 85609.57195214047, 85683.0, 86567.13432865654, 9478.90521094794, 9492.335536512515, 9524.476153811469, 9568.56941437637, 9912.207023438108, 22002.88998555029, 22171.0, 22366.217182398865, 22368.0, 22371.776282237293, 7463.328300452985, 7483.962580187064, 7586.544807311579, 7680.5391676499585, 7755.844883102306, 4110.815013324408, 4151.6886233532605, 4151.958480415217, 4176.436181115571, 4205.432266644025, 3604.6575575320303, 3609.314230296235, 3646.4712616670963, 3654.214343916071, 3659.579148397915, 622.4335854372499, 650.9674516274167, 683.040328338685, 690.1890278922347, 690.4441924251026, 503.87906902343906, 576.4811669497402, 609.1806520230372, 611.0742225528328, 622.8754249150188, 7900.249476299742, 8058.798530036679, 8190.754277371689, 8280.668773249003, 8320.958395207985, 473.0, 527.4698927577837, 534.5509771791714, 573.5669569475103, 615.802943058226, 3768.679662228741, 3856.382978723391, 3893.2992061429213, 3906.570277269498, 4025.0, 93637.51255063899, 95126.52436737771, 96041.0, 96315.0, 97039.0296097044, 62759.74480510456, 72949.0, 76622.0, 77299.0, 77745.0, 72595.0, 72676.27323726696, 72899.63550182321, 73191.0, 73817.0, 7107.360337569644, 7644.655990480331, 7802.81339474667, 7883.960580197062, 7914.643841027283, 35007.7747278844, 41787.0, 45000.54999450094, 49212.75393623152, 50786.746066269436, 68963.65518172376, 70810.93783593147, 72230.27769722235, 72342.1914452143, 73041.0, 10955.17836162307, 11161.386123763272, 11245.662630121109, 11428.714282143013, 11512.481938312629, 11819.468123934616, 11896.286222826659, 11918.344491053076, 11983.520659173535, 11999.340036298088, 11190.160737944523, 11306.0, 11359.204855660024, 12298.0, 12381.0, 11062.391568463812, 11355.48900299472, 11503.471390950657, 11531.538738450368, 11844.196742222959, 11233.0, 11242.325460472397, 11320.0, 11476.254043487146, 11588.188826782382, 8333.416660833684, 9314.227226202684, 9489.762755931157, 9551.046302996583, 10106.0, 8832.0, 9661.758456038655, 9708.708738737849, 9717.9028209717, 9795.9020409795], "unit": "score", "name": "yui.html", "value": 6916.704793542374}], "name": "dromaeo_css", "value": 7576.073166202396}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [115.0, 87.0, 167.0, 97.0, 167.0, 180.0, 163.0, 114.0, 113.0, 116.0], "unit": "score", "name": "ai-astar", "value": 131.9}, {"lowerIsBetter": true, "replicates": [151.0, 129.0, 145.0, 160.0, 124.0, 158.0, 171.0, 124.0, 162.0, 125.0], "unit": "score", "name": "audio-beat-detection", "value": 144.9}, {"lowerIsBetter": true, "replicates": [196.0, 277.0, 259.0, 229.0, 203.0, 201.0, 200.0, 228.0, 203.0, 198.0], "unit": "score", "name": "audio-dft", "value": 219.4}, {"lowerIsBetter": true, "replicates": [70.0, 71.0, 74.0, 113.0, 59.0, 57.0, 58.0, 59.0, 118.0, 56.0], "unit": "score", "name": "audio-fft", "value": 73.5}, {"lowerIsBetter": true, "replicates": [78.0, 80.0, 126.0, 80.0, 81.0, 81.0, 121.0, 84.0, 79.0, 120.0], "unit": "score", "name": "audio-oscillator", "value": 93.0}, {"lowerIsBetter": true, "replicates": [88.0, 89.0, 87.0, 85.0, 88.0, 85.0, 90.0, 86.0, 106.0, 127.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 93.1}, {"lowerIsBetter": true, "replicates": [145.0, 90.0, 146.0, 144.0, 95.0, 117.0, 147.0, 95.0, 94.0, 95.0], "unit": "score", "name": "imaging-darkroom", "value": 116.8}, {"lowerIsBetter": true, "replicates": [138.0, 145.0, 91.0, 99.0, 91.0, 91.0, 92.0, 90.0, 90.0, 142.0], "unit": "score", "name": "imaging-desaturate", "value": 106.9}, {"lowerIsBetter": true, "replicates": [46.0, 53.0, 59.0, 83.0, 66.0, 57.0, 56.0, 66.0, 59.0, 57.0], "unit": "score", "name": "json-parse-financial", "value": 60.2}, {"lowerIsBetter": true, "replicates": [64.0, 69.0, 69.0, 70.0, 81.0, 82.0, 99.0, 99.0, 89.0, 69.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 79.1}, {"lowerIsBetter": true, "replicates": [86.0, 84.0, 111.0, 108.0, 110.0, 106.0, 87.0, 83.0, 105.0, 111.0], "unit": "score", "name": "stanford-crypto-aes", "value": 99.1}, {"lowerIsBetter": true, "replicates": [121.0, 122.0, 129.0, 123.0, 123.0, 160.0, 126.0, 118.0, 129.0, 139.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 129.0}, {"lowerIsBetter": true, "replicates": [129.0, 139.0, 143.0, 141.0, 143.0, 131.0, 141.0, 141.0, 143.0, 129.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 138.0}, {"lowerIsBetter": true, "replicates": [71.0, 69.0, 67.0, 67.0, 71.0, 69.0, 66.0, 71.0, 70.0, 69.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 69.0}], "name": "kraken", "value": 1553.8999999999999}]} 22:47:02 INFO - Return code: 0 22:47:02 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 22:47:02 ERROR - # TBPL SUCCESS # 22:47:02 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 22:47:02 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 22:47:02 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 22:47:02 INFO - 2016-03-20 22:47:02.183 screenresolution[1693:10457] starting screenresolution argv=screenresolution get 22:47:02 INFO - 2016-03-20 22:47:02.186 screenresolution[1693:10457] Display 0: 1600x1200x32@60 22:47:02 INFO - 2016-03-20 22:47:02.191 screenresolution[1694:10460] starting screenresolution argv=screenresolution list 22:47:02 INFO - Available Modes on Display 0 22:47:02 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 22:47:02 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 22:47:02 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 22:47:02 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 22:47:02 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 22:47:02 INFO - Intel Iris: 22:47:02 INFO - Chipset Model: Intel Iris 22:47:02 INFO - Type: GPU 22:47:02 INFO - Bus: Built-In 22:47:02 INFO - VRAM (Dynamic, Max): 1536 MB 22:47:02 INFO - Vendor: Intel (0x8086) 22:47:02 INFO - Device ID: 0x0a2e 22:47:02 INFO - Revision ID: 0x0009 22:47:02 INFO - Displays: 22:47:02 INFO - Display: 22:47:02 INFO - Resolution: 1600 x 1200 @ 60 Hz 22:47:02 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 22:47:02 INFO - Display Serial Number: 1600x1200 60 22:47:02 INFO - Main Display: Yes 22:47:02 INFO - Mirror: Off 22:47:02 INFO - Online: Yes 22:47:02 INFO - Rotation: Supported 22:47:02 INFO - Return code: 0 22:47:02 INFO - Running post-action listener: _resource_record_post_action 22:47:02 INFO - Running post-run listener: _resource_record_post_run 22:47:03 INFO - Total resource usage - Wall time: 1208s; CPU: 54.0%; Read bytes: 34430464; Write bytes: 707008512; Read time: 370; Write time: 2052 22:47:03 INFO - install - Wall time: 34s; CPU: 55.0%; Read bytes: 381100544; Write bytes: 376310784; Read time: 28706; Write time: 710 22:47:03 INFO - run-tests - Wall time: 1175s; CPU: 54.0%; Read bytes: 33500672; Write bytes: 301661184; Read time: 354; Write time: 1280 22:47:03 INFO - Running post-run listener: _upload_blobber_files 22:47:03 INFO - Blob upload gear active. 22:47:03 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 22:47:03 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 22:47:03 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'] 22:47:03 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 22:47:03 INFO - (blobuploader) - INFO - Open directory for files ... 22:47:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 22:47:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 22:47:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 22:47:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 22:47:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 22:47:04 INFO - (blobuploader) - INFO - Done attempting. 22:47:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 22:47:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 22:47:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 22:47:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 22:47:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 22:47:05 INFO - (blobuploader) - INFO - Done attempting. 22:47:05 INFO - (blobuploader) - INFO - Iteration through files over. 22:47:05 INFO - Return code: 0 22:47:05 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 22:47:05 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 22:47:05 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/daac518d238f08413bc77879336a44fbc667cfcdff14524f835c1a67367568873c2b88cb979f7f14acbb7333423b294b0f0f62b623175b9cf112868aff5eaa5d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fdf7fa31c00109a610ec4eef63935e16bdca19044f585cebc43100257272daba8e0193251553e813d9066e718066e360860cb3e5bf03fe916e799358365e6717"} 22:47:05 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 22:47:05 INFO - Writing to file /builds/slave/test/properties/blobber_files 22:47:05 INFO - Contents: 22:47:05 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/daac518d238f08413bc77879336a44fbc667cfcdff14524f835c1a67367568873c2b88cb979f7f14acbb7333423b294b0f0f62b623175b9cf112868aff5eaa5d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fdf7fa31c00109a610ec4eef63935e16bdca19044f585cebc43100257272daba8e0193251553e813d9066e718066e360860cb3e5bf03fe916e799358365e6717"} 22:47:05 INFO - Running post-run listener: copy_logs_to_upload_dir 22:47:05 INFO - Copying logs to upload dir... 22:47:05 INFO - mkdir: /builds/slave/test/build/upload/logs 22:47:05 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1295.074360 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 35 secs) (at 2016-03-20 22:47:05.866802) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-20 22:47:05.870231) ========= 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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners TMPDIR=/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/daac518d238f08413bc77879336a44fbc667cfcdff14524f835c1a67367568873c2b88cb979f7f14acbb7333423b294b0f0f62b623175b9cf112868aff5eaa5d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fdf7fa31c00109a610ec4eef63935e16bdca19044f585cebc43100257272daba8e0193251553e813d9066e718066e360860cb3e5bf03fe916e799358365e6717"} build_url:https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011544 build_url: 'https://queue.taskcluster.net/v1/task/ArvOJhhDSeCtoqZ4xnlcWQ/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/daac518d238f08413bc77879336a44fbc667cfcdff14524f835c1a67367568873c2b88cb979f7f14acbb7333423b294b0f0f62b623175b9cf112868aff5eaa5d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fdf7fa31c00109a610ec4eef63935e16bdca19044f585cebc43100257272daba8e0193251553e813d9066e718066e360860cb3e5bf03fe916e799358365e6717"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-20 22:47:05.897630) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-20 22:47:05.897948) ========= 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.dHeCqV9X9h/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.UY6ZVlQ2eb/Listeners TMPDIR=/var/folders/cr/txgjfp9j4mnbstqzvq00gdx400000w/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.005395 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-20 22:47:05.946352) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-20 22:47:05.946624) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-20 22:47:05.946964) ========= ========= Total master_lag: 0.32 =========