builder: fx-team_yosemite_test-dromaeojs-e10s slave: t-yosemite-r5-0012 starttime: 1447759502.01 results: success (0) buildid: 20151117012303 builduid: 15e588ec8d344b70b404b4a16183d2e7 revision: 40e3ec35113722d706a62898082dfb0adeb9867c ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.006908) ========= master: http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.007437) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.007779) ========= 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.HfYdXLAy2f/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.8g6lBHAQcc/Listeners TMPDIR=/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/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:0x0:0x0 using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006143 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.034742) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.035110) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.053740) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.054125) ========= 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.HfYdXLAy2f/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.8g6lBHAQcc/Listeners TMPDIR=/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/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:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.005644 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.104086) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.104434) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.104866) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.105178) ========= 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.HfYdXLAy2f/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.8g6lBHAQcc/Listeners TMPDIR=/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/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:0x0:0x0 using PTY: False --2015-11-17 03:25:02-- 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% 1.41G=0s 2015-11-17 03:25:02 (1.41 GB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.175153 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.299386) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.299785) ========= 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.HfYdXLAy2f/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.8g6lBHAQcc/Listeners TMPDIR=/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/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:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.019909 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:02.350052) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-17 03:25:02.350619) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 40e3ec35113722d706a62898082dfb0adeb9867c --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 40e3ec35113722d706a62898082dfb0adeb9867c --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.HfYdXLAy2f/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.8g6lBHAQcc/Listeners TMPDIR=/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/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:0x0:0x0 using PTY: False 2015-11-17 03:25:02,421 truncating revision to first 12 chars 2015-11-17 03:25:02,421 Setting DEBUG logging. 2015-11-17 03:25:02,421 attempt 1/10 2015-11-17 03:25:02,421 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/40e3ec351137?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-17 03:25:03,194 unpacking tar archive at: fx-team-40e3ec351137/testing/mozharness/ program finished with exit code 0 elapsedTime=1.020871 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-17 03:25:03.392152) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:03.392586) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:03.410071) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:03.410440) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-17 03:25:03.410928) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 44 secs) (at 2015-11-17 03:25:03.411267) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--system-bits', '64', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.HfYdXLAy2f/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.8g6lBHAQcc/Listeners TMPDIR=/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/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:0x0:0x0 using PTY: False 03:25:03 INFO - MultiFileLogger online at 20151117 03:25:03 in /builds/slave/test 03:25:03 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 03:25:03 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:25:03 INFO - {'append_to_log': False, 03:25:03 INFO - 'base_work_dir': '/builds/slave/test', 03:25:03 INFO - 'blob_upload_branch': 'Fx-Team', 03:25:03 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:25:03 INFO - 'branch': 'Fx-Team', 03:25:03 INFO - 'buildbot_json_path': 'buildprops.json', 03:25:03 INFO - 'config_files': ('talos/mac_config.py',), 03:25:03 INFO - 'default_actions': ('clobber', 03:25:03 INFO - 'read-buildbot-config', 03:25:03 INFO - 'download-and-extract', 03:25:03 INFO - 'populate-webroot', 03:25:03 INFO - 'create-virtualenv', 03:25:03 INFO - 'install', 03:25:03 INFO - 'run-tests'), 03:25:03 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:25:03 INFO - 'download_minidump_stackwalk': True, 03:25:03 INFO - 'download_symbols': 'ondemand', 03:25:03 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:25:03 INFO - 'tooltool.py': '/tools/tooltool.py', 03:25:03 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:25:03 INFO - '/tools/misc-python/virtualenv.py')}, 03:25:03 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:25:03 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:25:03 INFO - 'installer_path': 'installer.exe', 03:25:03 INFO - 'log_level': 'info', 03:25:03 INFO - 'log_name': 'talos', 03:25:03 INFO - 'log_to_console': True, 03:25:03 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 03:25:03 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 03:25:03 INFO - 'opt_config_files': (), 03:25:03 INFO - 'pip_index': False, 03:25:03 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 03:25:03 INFO - 'cmd': ('bash', 03:25:03 INFO - '-c', 03:25:03 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 03:25:03 INFO - 'enabled': True, 03:25:03 INFO - 'halt_on_failure': False, 03:25:03 INFO - 'name': 'check_screen_resolution'},), 03:25:03 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 03:25:03 INFO - 'cmd': ('bash', 03:25:03 INFO - '-c', 03:25:03 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 03:25:03 INFO - 'enabled': True, 03:25:03 INFO - 'halt_on_failure': False, 03:25:03 INFO - 'name': 'check_screen_resolution'},), 03:25:03 INFO - 'run_cmd_checks_enabled': True, 03:25:03 INFO - 'sps_profile': False, 03:25:03 INFO - 'sps_profile_interval': 0, 03:25:03 INFO - 'suite': 'dromaeojs-e10s', 03:25:03 INFO - 'system_bits': '64', 03:25:03 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:25:03 INFO - 'title': 't-yosemite-r5-0012', 03:25:03 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:25:03 INFO - 'use_talos_json': True, 03:25:03 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:25:03 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:25:03 INFO - 'work_dir': 'build'} 03:25:03 INFO - ##### 03:25:03 INFO - ##### Running clobber step. 03:25:03 INFO - ##### 03:25:03 INFO - Running pre-action listener: _resource_record_pre_action 03:25:03 INFO - Running main action method: clobber 03:25:03 INFO - rmtree: /builds/slave/test/build 03:25:03 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:25:05 INFO - Running post-action listener: _resource_record_post_action 03:25:05 INFO - ##### 03:25:05 INFO - ##### Running read-buildbot-config step. 03:25:05 INFO - ##### 03:25:05 INFO - Running pre-action listener: _resource_record_pre_action 03:25:05 INFO - Running main action method: read_buildbot_config 03:25:05 INFO - Using buildbot properties: 03:25:05 INFO - { 03:25:05 INFO - "properties": { 03:25:05 INFO - "buildnumber": 61, 03:25:05 INFO - "product": "firefox", 03:25:05 INFO - "script_repo_revision": "production", 03:25:05 INFO - "builddir": "fx-team_yosemite_test-dromaeojs-e10s", 03:25:05 INFO - "repository": "", 03:25:05 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 fx-team talos dromaeojs-e10s", 03:25:05 INFO - "buildid": "20151117012303", 03:25:05 INFO - "slavename": "t-yosemite-r5-0012", 03:25:05 INFO - "pgo_build": "False", 03:25:05 INFO - "basedir": "/builds/slave/test", 03:25:05 INFO - "project": "", 03:25:05 INFO - "platform": "yosemite", 03:25:05 INFO - "master": "http://buildbot-master108.bb.releng.scl3.mozilla.com:8201/", 03:25:05 INFO - "slavebuilddir": "test", 03:25:05 INFO - "scheduler": "tests-fx-team-macosx64-talos", 03:25:05 INFO - "branch": "fx-team", 03:25:05 INFO - "repo_path": "integration/fx-team", 03:25:05 INFO - "stage_platform": "macosx64", 03:25:05 INFO - "builduid": "15e588ec8d344b70b404b4a16183d2e7", 03:25:05 INFO - "revision": "40e3ec35113722d706a62898082dfb0adeb9867c" 03:25:05 INFO - }, 03:25:05 INFO - "sourcestamp": { 03:25:05 INFO - "repository": "", 03:25:05 INFO - "hasPatch": false, 03:25:05 INFO - "project": "", 03:25:05 INFO - "branch": "fx-team-macosx64-talos", 03:25:05 INFO - "changes": [ 03:25:05 INFO - { 03:25:05 INFO - "category": null, 03:25:05 INFO - "files": [ 03:25:05 INFO - { 03:25:05 INFO - "url": null, 03:25:05 INFO - "name": "https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 03:25:05 INFO - } 03:25:05 INFO - ], 03:25:05 INFO - "repository": "", 03:25:05 INFO - "rev": "40e3ec35113722d706a62898082dfb0adeb9867c", 03:25:05 INFO - "who": "s.kaspari@gmail.com", 03:25:05 INFO - "when": 1447758183, 03:25:05 INFO - "number": 6671154, 03:25:05 INFO - "comments": "Bug 1222381 - Remove default theme for restricted profiles. r=ally\n\nInstead we will introduce a theme picker in bug 1220251.", 03:25:05 INFO - "project": "", 03:25:05 INFO - "at": "Tue 17 Nov 2015 03:03:03", 03:25:05 INFO - "branch": "fx-team-macosx64-talos", 03:25:05 INFO - "revlink": "", 03:25:05 INFO - "properties": [ 03:25:05 INFO - [ 03:25:05 INFO - "buildid", 03:25:05 INFO - "20151117012303", 03:25:05 INFO - "Change" 03:25:05 INFO - ], 03:25:05 INFO - [ 03:25:05 INFO - "builduid", 03:25:05 INFO - "15e588ec8d344b70b404b4a16183d2e7", 03:25:05 INFO - "Change" 03:25:05 INFO - ], 03:25:05 INFO - [ 03:25:05 INFO - "pgo_build", 03:25:05 INFO - "False", 03:25:05 INFO - "Change" 03:25:05 INFO - ] 03:25:05 INFO - ], 03:25:05 INFO - "revision": "40e3ec35113722d706a62898082dfb0adeb9867c" 03:25:05 INFO - } 03:25:05 INFO - ], 03:25:05 INFO - "revision": "40e3ec35113722d706a62898082dfb0adeb9867c" 03:25:05 INFO - } 03:25:05 INFO - } 03:25:05 INFO - Found installer url https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 03:25:05 INFO - Running post-action listener: _resource_record_post_action 03:25:05 INFO - ##### 03:25:05 INFO - ##### Running download-and-extract step. 03:25:05 INFO - ##### 03:25:05 INFO - Running pre-action listener: _resource_record_pre_action 03:25:05 INFO - Running main action method: download_and_extract 03:25:05 INFO - mkdir: /builds/slave/test/build/tests 03:25:05 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')]} 03:25:05 INFO - https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 03:25:05 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/test_packages.json 03:25:05 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/test_packages.json 03:25:05 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 03:25:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 03:25:05 INFO - Downloaded 1149 bytes. 03:25:05 INFO - Reading from file /builds/slave/test/build/test_packages.json 03:25:05 INFO - Using the following test package requirements: 03:25:05 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 03:25:05 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 03:25:05 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 03:25:05 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 03:25:05 INFO - u'jsshell-mac.zip'], 03:25:05 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 03:25:05 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 03:25:05 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 03:25:05 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 03:25:05 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 03:25:05 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 03:25:05 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 03:25:05 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 03:25:05 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 03:25:05 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 03:25:05 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 03:25:05 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 03:25:05 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 03:25:05 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')]} 03:25:05 INFO - https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 03:25:05 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 03:25:05 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 03:25:05 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 03:25:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 03:25:06 INFO - Downloaded 17460765 bytes. 03:25:06 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 03:25:06 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 03:25:06 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 03:25:12 INFO - Return code: 0 03:25:12 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip', u'firefox-45.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 03:25: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')]} 03:25:12 INFO - https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 03:25:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 03:25:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 03:25:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 03:25:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 03:25:13 INFO - Downloaded 17460765 bytes. 03:25:13 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 03:25:13 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 03:25:13 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 03:25:18 INFO - Return code: 0 03:25:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:25:18 INFO - https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 03:25:18 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 03:25:18 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 03:25:18 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 03:25:18 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'}, attempt #1 03:25:19 INFO - Downloaded 11131693 bytes. 03:25:19 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] in /builds/slave/test/build/tests 03:25:19 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 03:25:19 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 03:25:20 INFO - Return code: 0 03:25:20 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')]} 03:25:20 INFO - https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 03:25:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 03:25:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 03:25:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 03:25:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg'}, attempt #1 03:25:23 INFO - Downloaded 108757285 bytes. 03:25:23 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 03:25:23 INFO - mkdir: /builds/slave/test/properties 03:25:23 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:25:23 INFO - Writing to file /builds/slave/test/properties/build_url 03:25:23 INFO - Contents: 03:25:23 INFO - build_url:https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 03:25:23 INFO - Running post-action listener: _resource_record_post_action 03:25:23 INFO - Running post-action listener: set_extra_try_arguments 03:25:23 INFO - ##### 03:25:23 INFO - ##### Running populate-webroot step. 03:25:23 INFO - ##### 03:25:23 INFO - Running pre-action listener: _resource_record_pre_action 03:25:23 INFO - Running main action method: populate_webroot 03:25:23 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:25:23 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:25:23 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 03:25:23 INFO - '../fennec_ids.txt'], 03:25:23 INFO - 'tests': ['tcheck2']}, 03:25:23 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:25:23 INFO - '--tppagecycles', 03:25:23 INFO - '7'], 03:25:23 INFO - 'tests': ['tsvgm']}}, 03:25:23 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 03:25:23 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 03:25:23 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:25:23 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 03:25:23 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 03:25:23 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 03:25:23 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:25:23 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:25:23 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:25:23 INFO - 'talos_options': ['--e10s'], 03:25:23 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:25:23 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:25:23 INFO - 'tests': ['damp', 'tps']}, 03:25:23 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:25:23 INFO - 'talos_options': ['--e10s'], 03:25:23 INFO - 'tests': ['damp', 'tps']}, 03:25:23 INFO - 'g3': {'tests': ['dromaeo_dom']}, 03:25:23 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:25:23 INFO - 'other': {'tests': ['a11yr', 03:25:23 INFO - 'ts_paint', 03:25:23 INFO - 'tpaint', 03:25:23 INFO - 'sessionrestore', 03:25:23 INFO - 'sessionrestore_no_auto_restore']}, 03:25:23 INFO - 'other-e10s': {'talos_options': ['--e10s'], 03:25:23 INFO - 'tests': ['a11yr', 03:25:23 INFO - 'ts_paint', 03:25:23 INFO - 'tpaint', 03:25:23 INFO - 'sessionrestore', 03:25:23 INFO - 'sessionrestore_no_auto_restore']}, 03:25:23 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 03:25:23 INFO - 'tests': ['a11yr', 03:25:23 INFO - 'ts_paint', 03:25:23 INFO - 'tpaint', 03:25:23 INFO - 'sessionrestore', 03:25:23 INFO - 'sessionrestore_no_auto_restore']}, 03:25:23 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 03:25:23 INFO - 'tests': ['a11yr', 03:25:23 INFO - 'ts_paint', 03:25:23 INFO - 'tpaint', 03:25:23 INFO - 'sessionrestore', 03:25:23 INFO - 'sessionrestore_no_auto_restore']}, 03:25:23 INFO - 'other_l64': {'tests': ['a11yr', 03:25:23 INFO - 'ts_paint', 03:25:23 INFO - 'tpaint', 03:25:23 INFO - 'sessionrestore', 03:25:23 INFO - 'sessionrestore_no_auto_restore']}, 03:25:23 INFO - 'other_nol64': {'tests': ['a11yr', 03:25:23 INFO - 'ts_paint', 03:25:23 INFO - 'tpaint', 03:25:23 INFO - 'sessionrestore', 03:25:23 INFO - 'sessionrestore_no_auto_restore']}, 03:25:23 INFO - 'svgr': {'tests': ['tsvgx', 03:25:23 INFO - 'tsvgr_opacity', 03:25:23 INFO - 'tart', 03:25:23 INFO - 'tscrollx', 03:25:23 INFO - 'cart']}, 03:25:23 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 03:25:23 INFO - 'tests': ['tsvgx', 03:25:23 INFO - 'tsvgr_opacity', 03:25:23 INFO - 'tart', 03:25:23 INFO - 'tscrollx', 03:25:23 INFO - 'cart']}, 03:25:23 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:25:23 INFO - 'tests': ['tp5o']}, 03:25:23 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:25:23 INFO - 'talos_options': ['--e10s'], 03:25:23 INFO - 'tests': ['tp5o']}, 03:25:23 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:25:23 INFO - 'talos_options': ['--xperf_path', 03:25:23 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:25:23 INFO - 'tests': ['tp5n']}, 03:25:23 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:25:23 INFO - 'talos_options': ['--e10s', 03:25:23 INFO - '--xperf_path', 03:25:23 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:25:23 INFO - 'tests': ['tp5n']}}, 03:25:23 INFO - 'talos.zip': {'path': '', 03:25:23 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:25:23 INFO - Running post-action listener: _resource_record_post_action 03:25:23 INFO - ##### 03:25:23 INFO - ##### Running create-virtualenv step. 03:25:23 INFO - ##### 03:25:23 INFO - Running pre-action listener: _resource_record_pre_action 03:25:23 INFO - Running main action method: create_virtualenv 03:25:23 INFO - Creating virtualenv /builds/slave/test/build/venv 03:25:23 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 03:25:23 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:25:23 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:25:23 INFO - Using real prefix '/tools/python27' 03:25:23 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:25:24 INFO - Installing distribute.............................................................................................................................................................................................done. 03:25:27 INFO - Installing pip.................done. 03:25:27 INFO - Return code: 0 03:25:27 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:25: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')]} 03:25:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:25:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25: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')]} 03:25:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:25:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25:27 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x109406490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093e3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa65060e430>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093299f0>, '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 0x109089db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10931d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/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.8g6lBHAQcc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:25:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 03:25:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 03:25:27 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/Render', 03:25:27 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:25:27 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:25:27 INFO - 'HOME': '/Users/cltbld', 03:25:27 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:25:27 INFO - 'LOGNAME': 'cltbld', 03:25:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:25:27 INFO - 'MOZ_NO_REMOTE': '1', 03:25:27 INFO - 'NO_EM_RESTART': '1', 03:25:27 INFO - 'PAGER': '/bin/cat', 03:25:27 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:25:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:25:27 INFO - 'PWD': '/builds/slave/test', 03:25:27 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:25:27 INFO - 'SHELL': '/bin/bash', 03:25:27 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.8g6lBHAQcc/Listeners', 03:25:27 INFO - 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', 03:25:27 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:25:27 INFO - 'USER': 'cltbld', 03:25:27 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:25:27 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:25:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:25:27 INFO - 'XPC_FLAGS': '0x0', 03:25:27 INFO - 'XPC_SERVICE_NAME': '0', 03:25:27 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 03:25:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:25:28 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 03:25:28 INFO - Cleaning up... 03:25:28 INFO - Return code: 0 03:25:28 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 03:25:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:25:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:25:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:25:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:25:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x109406490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093e3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa65060e430>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093299f0>, '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 0x109089db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10931d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/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.8g6lBHAQcc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:25:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 03:25:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 03:25:28 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/Render', 03:25:28 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:25:28 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:25:28 INFO - 'HOME': '/Users/cltbld', 03:25:28 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:25:28 INFO - 'LOGNAME': 'cltbld', 03:25:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:25:28 INFO - 'MOZ_NO_REMOTE': '1', 03:25:28 INFO - 'NO_EM_RESTART': '1', 03:25:28 INFO - 'PAGER': '/bin/cat', 03:25:28 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:25:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:25:28 INFO - 'PWD': '/builds/slave/test', 03:25:28 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:25:28 INFO - 'SHELL': '/bin/bash', 03:25:28 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.8g6lBHAQcc/Listeners', 03:25:28 INFO - 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', 03:25:28 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:25:28 INFO - 'USER': 'cltbld', 03:25:28 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:25:28 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:25:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:25:28 INFO - 'XPC_FLAGS': '0x0', 03:25:28 INFO - 'XPC_SERVICE_NAME': '0', 03:25:28 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 03:25:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:25:28 INFO - Downloading/unpacking psutil>=0.7.1 03:25:28 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 03:25:28 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 03:25:28 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 03:25:28 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 03:25:28 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 03:25:28 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 03:25:30 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 03:25:30 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 03:25:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:25:31 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:25:31 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:25:31 INFO - Installing collected packages: psutil 03:25:31 INFO - Running setup.py install for psutil 03:25:31 INFO - building 'psutil._psutil_osx' extension 03:25:31 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 03:25:31 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 03:25:31 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 03:25:31 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 03:25:31 INFO - building 'psutil._psutil_posix' extension 03:25:31 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 03:25:31 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 03:25:31 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 03:25:31 INFO - ^ 03:25:31 INFO - 1 warning generated. 03:25:31 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 03:25:32 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:25:32 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:25:32 INFO - Successfully installed psutil 03:25:32 INFO - Cleaning up... 03:25:32 INFO - Return code: 0 03:25:32 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 03: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')]} 03:25:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:25:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03: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')]} 03:25:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:25:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25:32 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x109406490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093e3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa65060e430>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093299f0>, '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 0x109089db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10931d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/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.8g6lBHAQcc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:25:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 03:25:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 03:25:32 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/Render', 03:25:32 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:25:32 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:25:32 INFO - 'HOME': '/Users/cltbld', 03:25:32 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:25:32 INFO - 'LOGNAME': 'cltbld', 03:25:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:25:32 INFO - 'MOZ_NO_REMOTE': '1', 03:25:32 INFO - 'NO_EM_RESTART': '1', 03:25:32 INFO - 'PAGER': '/bin/cat', 03:25:32 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:25:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:25:32 INFO - 'PWD': '/builds/slave/test', 03:25:32 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:25:32 INFO - 'SHELL': '/bin/bash', 03:25:32 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.8g6lBHAQcc/Listeners', 03:25:32 INFO - 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', 03:25:32 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:25:32 INFO - 'USER': 'cltbld', 03:25:32 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:25:32 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:25:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:25:32 INFO - 'XPC_FLAGS': '0x0', 03:25:32 INFO - 'XPC_SERVICE_NAME': '0', 03:25:32 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 03:25:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:25:32 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 03:25:32 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 03:25:32 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 03:25:32 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 03:25:32 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 03:25:32 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 03:25:32 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 03:25:35 INFO - Downloading mozsystemmonitor-0.0.tar.gz 03:25:35 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 03:25:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:25:35 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 03:25:35 INFO - Installing collected packages: mozsystemmonitor 03:25:35 INFO - Running setup.py install for mozsystemmonitor 03:25:35 INFO - Successfully installed mozsystemmonitor 03:25:35 INFO - Cleaning up... 03:25:35 INFO - Return code: 0 03:25:35 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:25: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')]} 03:25:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:25:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25: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')]} 03:25:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:25:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x109406490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093e3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa65060e430>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093299f0>, '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 0x109089db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10931d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/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.8g6lBHAQcc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:25:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 03:25:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 03:25:35 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/Render', 03:25:35 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:25:35 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:25:35 INFO - 'HOME': '/Users/cltbld', 03:25:35 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:25:35 INFO - 'LOGNAME': 'cltbld', 03:25:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:25:35 INFO - 'MOZ_NO_REMOTE': '1', 03:25:35 INFO - 'NO_EM_RESTART': '1', 03:25:35 INFO - 'PAGER': '/bin/cat', 03:25:35 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:25:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:25:35 INFO - 'PWD': '/builds/slave/test', 03:25:35 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:25:35 INFO - 'SHELL': '/bin/bash', 03:25:35 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.8g6lBHAQcc/Listeners', 03:25:35 INFO - 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', 03:25:35 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:25:35 INFO - 'USER': 'cltbld', 03:25:35 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:25:35 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:25:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:25:35 INFO - 'XPC_FLAGS': '0x0', 03:25:35 INFO - 'XPC_SERVICE_NAME': '0', 03:25:35 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 03:25:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:25:35 INFO - Downloading/unpacking blobuploader==1.2.4 03:25:35 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 03:25:35 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 03:25:35 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 03:25:35 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 03:25:35 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 03:25:35 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 03:25:38 INFO - Downloading blobuploader-1.2.4.tar.gz 03:25:38 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 03:25:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:25:38 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:25:38 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 03:25:38 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 03:25:38 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 03:25:38 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 03:25:38 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 03:25:38 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 03:25:38 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 03:25:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:25:39 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:25:39 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 03:25:39 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 03:25:39 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 03:25:39 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 03:25:39 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 03:25:39 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 03:25:39 INFO - Downloading docopt-0.6.1.tar.gz 03:25:39 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 03:25:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:25:39 INFO - Installing collected packages: blobuploader, requests, docopt 03:25:39 INFO - Running setup.py install for blobuploader 03:25:39 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:25:39 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:25:39 INFO - Running setup.py install for requests 03:25:40 INFO - Running setup.py install for docopt 03:25:40 INFO - Successfully installed blobuploader requests docopt 03:25:40 INFO - Cleaning up... 03:25:40 INFO - Return code: 0 03:25:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:25: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')]} 03:25:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:25:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25: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')]} 03:25:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:25:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x109406490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093e3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa65060e430>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093299f0>, '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 0x109089db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10931d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/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.8g6lBHAQcc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:25:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 03:25:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:25:40 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/Render', 03:25:40 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:25:40 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:25:40 INFO - 'HOME': '/Users/cltbld', 03:25:40 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:25:40 INFO - 'LOGNAME': 'cltbld', 03:25:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:25:40 INFO - 'MOZ_NO_REMOTE': '1', 03:25:40 INFO - 'NO_EM_RESTART': '1', 03:25:40 INFO - 'PAGER': '/bin/cat', 03:25:40 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:25:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:25:40 INFO - 'PWD': '/builds/slave/test', 03:25:40 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:25:40 INFO - 'SHELL': '/bin/bash', 03:25:40 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.8g6lBHAQcc/Listeners', 03:25:40 INFO - 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', 03:25:40 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:25:40 INFO - 'USER': 'cltbld', 03:25:40 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:25:40 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:25:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:25:40 INFO - 'XPC_FLAGS': '0x0', 03:25:40 INFO - 'XPC_SERVICE_NAME': '0', 03:25:40 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 03:25:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:25:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:25:40 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-Vkn0iT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:25:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:25:41 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-pdVjpy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:25:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:25:41 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-zumQqL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:25:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:25:41 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-OlDBwo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:25:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:25:41 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-lG4pz6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:25:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:25:41 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-cWCQXI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:25:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:25:41 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-8lZKWU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:25:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:25:41 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-jHyqFd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:25:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:25:41 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-h_5wrW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:25:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:25:42 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-epf8gl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:25:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:25:42 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-bSZe2p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:25:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:25:42 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-0Aa83B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:25:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:25:42 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-saUqvF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:25:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:25:42 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-55yuXK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:25:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:25:42 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-v5tSAb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:25:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:25:42 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-jBAqC1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:25:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:25:42 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-KlHnLc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:25:43 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:25:43 INFO - Running setup.py install for manifestparser 03:25:43 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:25:43 INFO - Running setup.py install for mozcrash 03:25:43 INFO - Running setup.py install for mozdebug 03:25:43 INFO - Running setup.py install for mozdevice 03:25:43 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 03:25:43 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:25:43 INFO - Running setup.py install for mozfile 03:25:44 INFO - Running setup.py install for mozhttpd 03:25:44 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:25:44 INFO - Running setup.py install for mozinfo 03:25:44 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:25:44 INFO - Running setup.py install for mozInstall 03:25:44 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:25:44 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:25:44 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:25:44 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:25:44 INFO - Running setup.py install for mozleak 03:25:44 INFO - Running setup.py install for mozlog 03:25:44 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:25:44 INFO - Running setup.py install for moznetwork 03:25:45 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:25:45 INFO - Running setup.py install for mozprocess 03:25:45 INFO - Running setup.py install for mozprofile 03:25:45 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:25:45 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:25:45 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:25:45 INFO - Running setup.py install for mozrunner 03:25:45 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:25:45 INFO - Running setup.py install for mozscreenshot 03:25:45 INFO - Running setup.py install for moztest 03:25:46 INFO - Running setup.py install for mozversion 03:25:46 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:25:46 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:25:46 INFO - Cleaning up... 03:25:46 INFO - Return code: 0 03:25:46 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:25:46 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')]} 03:25:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:25:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25:46 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')]} 03:25:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:25:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x109406490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093e3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa65060e430>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093299f0>, '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 0x109089db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10931d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/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.8g6lBHAQcc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:25:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 03:25:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:25:46 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/Render', 03:25:46 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:25:46 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:25:46 INFO - 'HOME': '/Users/cltbld', 03:25:46 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:25:46 INFO - 'LOGNAME': 'cltbld', 03:25:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:25:46 INFO - 'MOZ_NO_REMOTE': '1', 03:25:46 INFO - 'NO_EM_RESTART': '1', 03:25:46 INFO - 'PAGER': '/bin/cat', 03:25:46 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:25:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:25:46 INFO - 'PWD': '/builds/slave/test', 03:25:46 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:25:46 INFO - 'SHELL': '/bin/bash', 03:25:46 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.8g6lBHAQcc/Listeners', 03:25:46 INFO - 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', 03:25:46 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:25:46 INFO - 'USER': 'cltbld', 03:25:46 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:25:46 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:25:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:25:46 INFO - 'XPC_FLAGS': '0x0', 03:25:46 INFO - 'XPC_SERVICE_NAME': '0', 03:25:46 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 03:25:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:25:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:25:46 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-krPjBM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:25:46 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)) 03:25:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:25:46 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-fe40ne-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:25:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:25:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:25:46 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-LrFTdb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:25:46 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)) 03:25:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:25:46 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-b0R1f3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:25:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:25:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:25:47 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-Pb9Xar-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:25:47 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)) 03:25:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:25:47 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-s7PEvI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:25:47 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)) 03:25:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:25:47 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-C2OKKR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:25:47 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)) 03:25:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:25:47 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-OjXEPm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:25:47 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)) 03:25:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:25:47 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-Kl71ms-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:25:47 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)) 03:25:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:25:47 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-0XenDV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:25:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:25:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:25:47 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-rQRFwt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:25:48 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)) 03:25:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:25:48 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-JZP27P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:25:48 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)) 03:25:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:25:48 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-n2smdo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:25:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 03:25:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:25:48 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-JIz1cE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:25:48 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)) 03:25:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:25:48 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-abEng3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:25:48 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)) 03:25:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:25:48 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-NrLaoc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:25:48 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)) 03:25:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:25:48 INFO - Running setup.py (path:/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/pip-ny1itk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:25:48 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)) 03:25:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:25:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:25:48 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)) 03:25:48 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:25:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:25:48 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:25: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 03:25: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 03:25: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 03:25: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 03:25: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 03:25: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 03:25:51 INFO - Downloading blessings-1.5.1.tar.gz 03:25:51 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 03:25:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:25:51 INFO - Installing collected packages: blessings 03:25:51 INFO - Running setup.py install for blessings 03:25:51 INFO - Successfully installed blessings 03:25:51 INFO - Cleaning up... 03:25:51 INFO - Return code: 0 03:25:51 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:25:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:25:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:25:52 INFO - Reading from file tmpfile_stdout 03:25:52 INFO - Current package versions: 03:25:52 INFO - blessings == 1.5.1 03:25:52 INFO - blobuploader == 1.2.4 03:25:52 INFO - docopt == 0.6.1 03:25:52 INFO - manifestparser == 1.1 03:25:52 INFO - mozInstall == 1.12 03:25:52 INFO - mozcrash == 0.16 03:25:52 INFO - mozdebug == 0.1 03:25:52 INFO - mozdevice == 0.47 03:25:52 INFO - mozfile == 1.2 03:25:52 INFO - mozhttpd == 0.7 03:25:52 INFO - mozinfo == 0.9 03:25:52 INFO - mozleak == 0.1 03:25:52 INFO - mozlog == 3.0 03:25:52 INFO - moznetwork == 0.27 03:25:52 INFO - mozprocess == 0.22 03:25:52 INFO - mozprofile == 0.27 03:25:52 INFO - mozrunner == 6.11 03:25:52 INFO - mozscreenshot == 0.1 03:25:52 INFO - mozsystemmonitor == 0.0 03:25:52 INFO - moztest == 0.7 03:25:52 INFO - mozversion == 1.4 03:25:52 INFO - psutil == 3.1.1 03:25:52 INFO - requests == 1.2.3 03:25:52 INFO - wsgiref == 0.1.2 03:25:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:25:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:25:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:25:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:25:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:25:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:25:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/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 0x109406490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093e3228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa65060e430>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1093299f0>, '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 0x109089db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10931d8c8>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/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.8g6lBHAQcc/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 03:25:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/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 03:25:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/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 03:25:52 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/Render', 03:25:52 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:25:52 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:25:52 INFO - 'HOME': '/Users/cltbld', 03:25:52 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:25:52 INFO - 'LOGNAME': 'cltbld', 03:25:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:25:52 INFO - 'MOZ_NO_REMOTE': '1', 03:25:52 INFO - 'NO_EM_RESTART': '1', 03:25:52 INFO - 'PAGER': '/bin/cat', 03:25:52 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:25:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:25:52 INFO - 'PWD': '/builds/slave/test', 03:25:52 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:25:52 INFO - 'SHELL': '/bin/bash', 03:25:52 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.8g6lBHAQcc/Listeners', 03:25:52 INFO - 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', 03:25:52 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:25:52 INFO - 'USER': 'cltbld', 03:25:52 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:25:52 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:25:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:25:52 INFO - 'XPC_FLAGS': '0x0', 03:25:52 INFO - 'XPC_SERVICE_NAME': '0', 03:25:52 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 03:25:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:25:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:25:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 03:25:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 03:25:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 03:25:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 03:25:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 03:25:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 03:25:52 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 03:25:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:25:52 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 03:25:52 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:25:52 INFO - Cleaning up... 03:25:52 INFO - Return code: 0 03:25:52 INFO - Running post-action listener: _resource_record_post_action 03:25:52 INFO - Running post-action listener: _start_resource_monitoring 03:25:52 INFO - Starting resource monitoring. 03:25:52 INFO - ##### 03:25:52 INFO - ##### Running install step. 03:25:52 INFO - ##### 03:25:52 INFO - Running pre-action listener: _resource_record_pre_action 03:25:52 INFO - Running main action method: install 03:25:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:25:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:25:52 INFO - Reading from file tmpfile_stdout 03:25:52 INFO - Detecting whether we're running mozinstall >=1.0... 03:25:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:25:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:25:52 INFO - Reading from file tmpfile_stdout 03:25:52 INFO - Output received: 03:25:52 INFO - Usage: mozinstall [options] installer 03:25:52 INFO - Options: 03:25:52 INFO - -h, --help show this help message and exit 03:25:52 INFO - -d DEST, --destination=DEST 03:25:52 INFO - Directory to install application into. [default: 03:25:52 INFO - "/builds/slave/test"] 03:25:52 INFO - --app=APP Application being installed. [default: firefox] 03:25:52 INFO - mkdir: /builds/slave/test/build/application 03:25:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 03:25:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 03:26:32 INFO - Reading from file tmpfile_stdout 03:26:32 INFO - Output received: 03:26:32 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 03:26:32 INFO - Running post-action listener: _resource_record_post_action 03:26:32 INFO - ##### 03:26:32 INFO - ##### Running run-tests step. 03:26:32 INFO - ##### 03:26:32 INFO - Running pre-action listener: _resource_record_pre_action 03:26:32 INFO - Running main action method: run_tests 03:26:32 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 03:26:32 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 03:26:32 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 03:26:32 INFO - 2015-11-17 03:26:32.257 screenresolution[2015:22921] starting screenresolution argv=screenresolution get 03:26:32 INFO - 2015-11-17 03:26:32.261 screenresolution[2015:22921] Display 0: 1600x1200x32@60 03:26:32 INFO - 2015-11-17 03:26:32.268 screenresolution[2016:22924] starting screenresolution argv=screenresolution list 03:26:32 INFO - Available Modes on Display 0 03:26:32 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 03:26:32 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 03:26:32 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 03:26:32 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 03:26:32 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 03:26:32 INFO - Intel HD Graphics 3000: 03:26:32 INFO - Chipset Model: Intel HD Graphics 3000 03:26:32 INFO - Type: GPU 03:26:32 INFO - Bus: Built-In 03:26:32 INFO - VRAM (Total): 512 MB 03:26:32 INFO - VRAM (Dynamic, Max): 10 03:26:32 INFO - Vendor: Intel (0x8086) 03:26:32 INFO - Device ID: 0x0116 03:26:32 INFO - Revision ID: 0x0009 03:26:32 INFO - Displays: 03:26:32 INFO - Display: 03:26:32 INFO - Resolution: 1600 x 1200 @ 60 Hz 03:26:32 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 03:26:32 INFO - Display Serial Number: 1600x1200 60 03:26:32 INFO - Main Display: Yes 03:26:32 INFO - Mirror: Off 03:26:32 INFO - Online: Yes 03:26:32 INFO - Rotation: Supported 03:26:32 INFO - Return code: 0 03:26:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:26:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:26:32 INFO - Python 2.7.3 03:26:32 INFO - Return code: 0 03:26:32 INFO - grabbing minidump binary from tooltool 03:26: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')]} 03:26:32 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 0x1093299f0>, '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 0x109089db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10931d8c8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:26:32 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 03:26:32 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 03:26:32 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:26:32 INFO - Return code: 0 03:26:32 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 03:26:32 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:26:32 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:26:32 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 03:26:32 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:26:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0012', '--webServer', 'localhost'] in /builds/slave/test/build 03:26:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0012 --webServer localhost 03:26:32 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.HfYdXLAy2f/Render', 03:26:32 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 03:26:32 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 03:26:32 INFO - 'HOME': '/Users/cltbld', 03:26:32 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 03:26:32 INFO - 'LOGNAME': 'cltbld', 03:26:32 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:26:32 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 03:26:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:26:32 INFO - 'MOZ_NO_REMOTE': '1', 03:26:32 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:26:32 INFO - 'NO_EM_RESTART': '1', 03:26:32 INFO - 'PAGER': '/bin/cat', 03:26:32 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 03:26:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:26:32 INFO - 'PWD': '/builds/slave/test', 03:26:32 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:26:32 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 03:26:32 INFO - 'SHELL': '/bin/bash', 03:26:32 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.8g6lBHAQcc/Listeners', 03:26:32 INFO - 'TMPDIR': '/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/', 03:26:32 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 03:26:32 INFO - 'USER': 'cltbld', 03:26:32 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 03:26:32 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 03:26:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:26:32 INFO - 'XPC_FLAGS': '0x0', 03:26:32 INFO - 'XPC_SERVICE_NAME': '0', 03:26:32 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 03:26:32 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0012', '--webServer', 'localhost'] with output_timeout 3600 03:26:32 INFO - mozversion INFO | application_buildid: 20151117012303 03:26:32 INFO - mozversion INFO | application_changeset: 40e3ec35113722d706a62898082dfb0adeb9867c 03:26:32 INFO - mozversion INFO | application_display_name: Nightly 03:26:32 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:26:32 INFO - mozversion INFO | application_name: Firefox 03:26:32 INFO - mozversion INFO | application_remotingname: firefox 03:26:32 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 03:26:32 INFO - mozversion INFO | application_vendor: Mozilla 03:26:32 INFO - mozversion INFO | application_version: 45.0a1 03:26:32 INFO - mozversion INFO | platform_buildid: 20151117012303 03:26:32 INFO - mozversion INFO | platform_changeset: 40e3ec35113722d706a62898082dfb0adeb9867c 03:26:32 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 03:26:32 INFO - mozversion INFO | platform_version: 45.0a1 03:26:32 INFO - 2015-11-17 03:26:32,906 DEBUG : using testdate: 1447759592 03:26:32 INFO - 2015-11-17 03:26:32,906 DEBUG : actual date: 1447759592 03:26:32 INFO - 2015-11-17 03:26:32,915 INFO : starting webserver on 'localhost:50965' 03:26:32 INFO - 2015-11-17 03:26:32,916 INFO : Starting test suite t-yosemite-r5-0012.e 03:26:32 INFO - 2015-11-17 03:26:32,916 INFO : Starting test dromaeo_css 03:26:32 INFO - 2015-11-17 03:26:32,916 DEBUG : operating with platform_type : mac_ 03:26:32 INFO - 2015-11-17 03:26:32,917 INFO : Initialising browser for dromaeo_css test... 03:26:32 INFO - 2015-11-17 03:26:32,953 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/tmpIgi3dW/profile http://localhost:50965/getInfo.html 03:26:36 INFO - 2015-11-17 03:26:36,626 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 03:26:36 INFO - 2015-11-17 03:26:36,626 DEBUG : BROWSER_OUTPUT: colorDepth:24 03:26:36 INFO - 2015-11-17 03:26:36,626 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 03:26:36 INFO - 2015-11-17 03:26:36,626 DEBUG : BROWSER_OUTPUT: __metrics 03:26:37 INFO - 2015-11-17 03:26:37,304 INFO : Browser initialized. 03:26:37 INFO - 2015-11-17 03:26:37,305 INFO : Running cycle 1/1 for dromaeo_css test... 03:26:37 INFO - 2015-11-17 03:26:37,305 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/tmpIgi3dW/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 03:26:49 INFO - 2015-11-17 03:26:49,432 DEBUG : BROWSER_OUTPUT: RSS: Main: 241012736 03:26:49 INFO - 2015-11-17 03:26:49,433 DEBUG : BROWSER_OUTPUT: 03:27:39 INFO - 2015-11-17 03:27:39,290 DEBUG : BROWSER_OUTPUT: 1447759659287 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] 03:29:48 INFO - 2015-11-17 03:29:48,711 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50965/tests/dromaeo/cssquery-ext.html) 03:29:49 INFO - 2015-11-17 03:29:49,833 DEBUG : BROWSER_OUTPUT: RSS: Main: 266166272 03:29:49 INFO - 2015-11-17 03:29:49,833 DEBUG : BROWSER_OUTPUT: 03:32:52 INFO - 2015-11-17 03:32:52,031 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/dromaeo/cssquery-ext.html (next: http://localhost:50965/tests/dromaeo/cssquery-jquery.html) 03:32:52 INFO - 2015-11-17 03:32:52,606 DEBUG : BROWSER_OUTPUT: RSS: Main: 271785984 03:32:52 INFO - 2015-11-17 03:32:52,606 DEBUG : BROWSER_OUTPUT: 03:35:54 INFO - 2015-11-17 03:35:54,324 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50965/tests/dromaeo/cssquery-mootools.html) 03:35:54 INFO - 2015-11-17 03:35:54,912 DEBUG : BROWSER_OUTPUT: RSS: Main: 273883136 03:35:54 INFO - 2015-11-17 03:35:54,912 DEBUG : BROWSER_OUTPUT: 03:38:56 INFO - 2015-11-17 03:38:56,726 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50965/tests/dromaeo/cssquery-prototype.html) 03:38:57 INFO - 2015-11-17 03:38:57,304 DEBUG : BROWSER_OUTPUT: RSS: Main: 278851584 03:38:57 INFO - 2015-11-17 03:38:57,304 DEBUG : BROWSER_OUTPUT: 03:41:59 INFO - 2015-11-17 03:41:59,851 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50965/tests/dromaeo/cssquery-yui.html) 03:42:00 INFO - 2015-11-17 03:42:00,438 DEBUG : BROWSER_OUTPUT: RSS: Main: 283951104 03:42:00 INFO - 2015-11-17 03:42:00,438 DEBUG : BROWSER_OUTPUT: 03:45:02 INFO - 2015-11-17 03:45:02,892 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/dromaeo/cssquery-yui.html (next: http://localhost:50965/tests/dromaeo/cssquery-dojo.html) 03:45:03 INFO - 2015-11-17 03:45:03,152 DEBUG : BROWSER_OUTPUT: RSS: Main: 289153024 03:45:03 INFO - 2015-11-17 03:45:03,153 DEBUG : BROWSER_OUTPUT: 03:45:03 INFO - 2015-11-17 03:45:03,153 DEBUG : BROWSER_OUTPUT: __start_tp_report 03:45:03 INFO - 2015-11-17 03:45:03,153 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 03:45:03 INFO - 2015-11-17 03:45:03,153 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 03:45:03 INFO - 2015-11-17 03:45:03,153 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 03:45:03 INFO - 2015-11-17 03:45:03,153 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2880.4383145286665;2888.4078763853413;2942.1614839770664;2943.7056294370577;3002.7297543221107;4732.5977291930185;4790.784414701338;4795.0649623323425;4856.2958371036175;4880.585150262232;4646.767661616923;4732.550407711271;4777.832775852846;4815.951840481594;4865.805367785284;4425.380446737451;4461.531539188387;4495.145922274757;4501.684882058257;4522.412086428776;123.63262318754576;4475.418195634579;4504.211762941472;4552.157850797613;4574.954250457503;4491.371208030879;4494.056248187884;4539.2737162054245;4557.316402539613;4569.702969307001;4468.151051300275;4531.342955271467;4536.86389408315;4546.136234115507;4581.175388430114;4335.544767799367;4343.04453020335;4446.355278484634;4448.621867141297;4459.777011149429;4686.601638860667;4730.432348118214;4761.976190119027;4772.164871147535;4844.951550484485;5105.438401775802;5149.0474262261605;5156.484351564851;5160.948390516121;5213.348331458567;5042.672226305279;5085.033843569747;5168.8449346519665;5183;5226.529612334908;4686.859394218179;4812.398450193726;4852.272159176152;4852.902941941176;4922.606191504707;5174.974125129425;5178.922316165261;5269.604779641542;5275.366955965232;5324.627276090637;4949.331840201598;4982.427020892644;5014;5033.546980771748;5081.669691470117;5187.06632806091;5193.195054766517;5210.322658054429;5261.184516399964;5288.788448462095;4925.926111108336;5050.191969284897;5122.078025955364;5126.231065340229;5142.177251639794;4920.803167873317;5094.5669618082875;5100.0819852426175;5106.412762532282;5156.1750119980625;3979.5622481527007;4002.939955900664;4020.2562525932794;4026.2148880968516;4067.328890732996;3497.965020349764;3503.649635036527;3535.876244331436;3640.9453858192146;3677.2093999790172;4891.6575839691595;4898.730569818694;4916.631252656065;4925.630577706686;4949.950500494949;5186.325777648882;5190.065788158092;5192.792288308426;5197.298364720715;5218.66078704883;4814.374131362901;4849.927251091236;4872.317875497433;4905.656604037683;4958.801647934114;4537.886552836206;4564.566366195206;4595.264757638762;4606.723596584216;4619.284010978304;5282.6302158849285;5289.788408463695;5321.5476684482255;5334.359876814807;5343.568230166156;5052.46949070357;5066.518680725325;5088.160453525127;5132.127538318569;5201.687898726089;5306.920396193983;5308.575313974796;5316.760745766373;5360.0619891518045;5367.677939323653;4903.877403064952;5168.689878607295;5170.870728231825;5197.792088316425;5216.765245564035;5110.977804439052;5158.638895277295;5183.196604526304;5188.792448302026;5199.63602547818;5071.949280507295;5088.262201980618;5097.158968770112;5102.79588816458;5136.434992150935;4929.852104436873;5008.373953255843;5046.823361182341;5053.620978426559;5113.923291150561;4838.298446725275;4886.951130488792;4895.388076490439;4953.331300274417;5015.04714104319;5045.11710450677;5055.595552355876;5099;5115.974420127875;5117.897642047213;4800.471948085638;4882.072406242803;4912.828051018198;5012.398512178562;5043.5460808527405 03:45:03 INFO - 2015-11-17 03:45:03,154 DEBUG : BROWSER_OUTPUT: |1;ext.html;491.6484713429899;506.076410550745;509.80882169186555;522.9567013807454;526.2947650148805;34804.477932830996;35585.2882942341;35610.2877942441;35696.46455303173;35738.10654733633;37197.25605487889;37744.81127594365;37864.62135378645;37868.81065594675;37916.620833791654;8285.378596605264;8464.280536154434;8479.576021198945;8483.490990540557;8484.66061357545;8253.95873020637;8376.832463350729;8386.37102217333;8388.706395276167;8389.370797190204;8152.18478152186;8182.672693092299;8322.126176751444;8323.66705331786;8381.07808141104;8359.540225287607;8397.202265784741;8439.746807595782;8471.06818249992;8476.364272679511;8038.437309388345;8169.959150204211;8267.049289331744;8278.254957053894;8280.378971577096;34510;35403;35457.46813797795;35472.46791298132;35511.64488355109;2204.647256438962;2378.607529757588;2587.0815860369485;2645.7486538778785;2758.7379198976064;23841.642375364383;24303.14938977145;24304.39239019021;24326.87836560806;24498.142565010316;2034.9287774927955;2083.7082808406835;2091.8117369436673;2095.3818623506104;2219.6004719150546;209134;209511;209667;210038.99999999846;210418;43770.34344484835;45335.093298133856;50153.24770128451;50558;50984.49015509798;47291;47352.05295894063;47392.52607473881;47398.763006185436;47423.525764742604;14162.221077840817;14213.78679319811;14315.28423578817;14420.855791442162;14461.204633745034;11076.778464430827;11132.49903754333;11188;11260.605878794202;11262.831057534144;16484.423045193602;16837.242324095445;16869.746953795704;16910.661786764194;16926.492205233862;7828.138904720477;8048.919510804817;8068.878966815502;8086.757397278091;8100.149484304181;820.8112134209165;837.3134030095264;877.3288434347729;903.2728653434049;936.0826390137703;23009.194678186184;23578.17476388318;23629.527409451715;24510.264692059267;24564.87717561401;922.5986695787354;938.1181689212119;961.240619910277;1022.6114076650974;1060.671191930504;12140.392980350947;12278.324692142018;12434.440450179764;12495.187812792321;12509.124361294804;285739;289236;289360;289871;293116;44906.775466123116;45307;45323;45344.546554534034;45461;1242.105683907585;1252.298712720861;1258.9118761686777;1263.3556885988212;1278.1883503975043;23495.41261468477;25223.49553008966;25559.361015974748;25854.482910342063;25876.223713288633;41354.37968430416;41815.1636967265;41836;41984.790076050645;42028.78985605053;225042;232415;232417;232808;233159;26833;39175.80412097921;40644.79677601593;40939.7953010233;41077;40274.1945161101;41637;41654.37518437165;41869;42139.7893010533;33553;33827.492587610715;34356.48465273073;34742.65257347394;35023.824880875436;34264.31471370609;34319.82840085884;34523.82738086394;34635.65364346425;34775;34223.31553368968;34268.48597270993;34745.131371714895;35264.11839703925;35493.82253088718;30657.693423065484;31495.21261968469;31708.524372133976;31766.523502147025;31855;22899;23360.299191024296;23656.763432365457;23665.881670591538;23700.644490333005 03:45:03 INFO - 2015-11-17 03:45:03,154 DEBUG : BROWSER_OUTPUT: |2;jquery.html;292.7935805257294;301.06069064518704;306.61366677985745;307.3254207015601;312.403309678514;10536.525856336464;10948.507317170726;15398;15410.306536205884;15946.92026539867;10143.391396516214;10211.591536338537;10565.630202942899;10566;10586.729592448917;3887.455756194135;3964.8810535683974;4005.158916627497;4014.578469260715;4018.77896715682;3963.8612648557305;3987.80060996949;4012.358022716366;4015.678745700337;4073.9185216295655;3022.8941987030457;3040.133561934849;4048.251073551388;4060.086480541869;4070.1859628074503;4203.180379825935;4337.240982827992;4369.825206991733;4377.430933978562;4377.956220437803;3617.2042150726797;3657.7988210648405;3661.340958627446;3704.240630670733;3714.665680088805;11808.409579520989;12101.515939362414;12106;12206;12221.327826969513;1728.9135543222787;1735.5400818783032;1741.878068535203;1774.104077440897;1831.8626103042325;8418.368622353348;8434;8588.44175128621;8706.216440520384;8724.258438032775;1356.1456282542033;1391.269583468677;1392.9094608850392;1426.8787153092;1446.2190417174713;50435;52687.73656131733;53183.46816531824;53581.73209133968;53917.46082539164;5762.481376676035;5790.160426738184;5841.4450627190345;5858.443447872445;5924.437178468039;6699.263081061079;6704.229013663394;6774.627395493295;6775.22084960226;6780.593164410053;4810;4879.5120487951635;4915.115279249698;4923.064617722621;4934.629902757308;5202.869928251748;5250.343707036621;5250.868728281824;5277.683338999673;5281.867953301198;2625.4880298342023;2627.8554679492813;2645.1799942018038;2657.4817910507654;2679.6918354389104;912.1289168843738;921.4425272709914;922.7831459606987;929.2983797233046;982.0964712464549;372.4208855230089;384.2909831361134;397.35628282183046;402.57528307635727;410.78228538874447;8908.8663670045;10399.48002599867;10675.626353077605;10711.517981690842;10792.78414431707;392.97249192556245;396.9226000929791;399.65030598226554;408.23048553476315;413.7558840284247;5511.917321240185;5706.201131841545;5746.195532625436;5787;5892.29292484896;473253;480978;485989;488766;491393;59784;61745;61795.691021544604;63156.36843631597;64194;431.41543208952044;444.41337434586035;445.21641910238213;449.15558749551286;449.91676539840233;9601.471919044241;9640.132388085107;9914.603415863285;10044.347117437343;10152.593896244363;27603.723962760116;28716;29012.709872901;29263.268418289714;29947.55078673865;36802.63197368099;37030.25939481249;37157.25685486329;39434.605653943094;40614;5582.190582365453;5608.355039170548;5652.576056795675;5713.9428605715075;5720.39935806751;10558.366498010144;10635;10749.785004299714;10756.623518176826;10841.698996120516;9136.908630913871;9263.490508022123;9300.72097837066;9359.298052645943;9363.250939924927;7805.687772489036;8818.250448711931;9026.774330641787;9072.183503484453;9349.53252337394;9240.676576319796;9306.255499559884;9479.28905332089;9512.95243523778;9521.57152928106;5477.370102438271;5576.804811831728;5641.887162256814;5641.943580564306;5645.209670646195;8839.867401988846;9065.728028159167;9229.169374756304;9244;9439.19766819828 03:45:03 INFO - 2015-11-17 03:45:03,155 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1458.5259790568055;1553.603831023089;1585.128179501274;1594.62526306318;1621.9432319868806;6388.712507937143;6644.700988455519;6967.198772141205;7438.962805185974;7449.962750186248;7200.459965502582;7277;7415.962920185391;7480.401567874571;7492.325690687837;2011.0648548425015;2048.9385318440395;2070.6479898417306;2072.3782865140397;2073.1603700501323;2014.5668681233533;2024.3319704497553;2058.557410156816;2075.3047729010723;2097.423208617635;2010.1155491583656;2015.3450128708155;2041.4692180033223;2046.467918341227;2064.2362325939425;2014.7280117184139;2036.399262217642;2040.8571400002006;2063.9690404643943;2065.39070974063;1979.0401655197218;1985.0769392232537;1987.6124155789628;2005.5688027074102;2009.7789243183238;7297.562146271241;7312.049433573655;7317;7424.034875466209;7434.7397841075845;4343.261645520269;4359.149965756678;4390.253656878338;4432.512423633398;4432.711873728197;2364.5861974154627;2466.0135945621714;2641;2705.3236690827293;2709.417475242832;773.1147835728116;804.4047404920375;806.1656185847678;810.1250649298743;818.4475479051616;8943.821123577558;9079.31905107113;9105.59024843877;9173.678921237724;9206.26349892007;3953.6046395360236;3981.3828856527284;4039.1921615676392;4089.427480152781;4100.384942258685;8471.618777155043;8560.443571167854;8604.913950860537;8648.654053837901;8668.523231222218;4470.530594287618;4483.843065492757;4496.505384407713;4518.909621807546;4547.15877562652;4068.186362727407;4071.1043570414463;4100.36444351126;4101.487314085739;4115.444415003996;3423.1442139465134;3507.649235076472;3520.1551627609188;3530.3468858261303;3538.4161613334027;1110.4336788238056;1117.3798541809374;1122.646366394583;1123.1744667669257;1133.8299255111635;945.8817647794026;961.20700422152;1180.6044974933493;1193.9522419103312;1200.2858299311895;6894.689738961759;6931.653417329113;6944.791656250321;6961.408280296231;6986.476014298948;1075.0485820049312;1103.4041617526445;1124.050177599943;1133.2124173699365;1138.9316641001567;5353.491418315254;5432.02223599748;5444.50999410055;5491.752871120809;5503.697296648723;8453.689945517583;8808.647654093893;8838.513881736437;8857.557122143868;8956.328275379372;8720.563971801384;8775.956120219485;8783.209511144029;8812.8678069829;8833.779155521035;6814.897776533356;6845.794626161123;6931.272216417305;6942.305769423118;6959.338862808025;6634.170728658918;6662.56693314933;6674.466042716474;6699.598024118569;6700.631465269262;7534.472586918863;7832.725854595062;7834.451588388758;7888.921110789048;7954.482958607672;7863.882041769492;8099.716509922125;8113.716019939274;8122.065962414398;8204.425690201628;6185.690715464299;6206.255249370104;6249.218847644044;6409.4231519163495;6486.54594178403;7048.30840598263;7086.468514861509;7101.644917754195;7103.25415831351;7140.821479463055;6587.374199451237;6618.801435956929;6648.5346025777735;6703.798886033427;6729.764458243938;6118.816435506764;6467.417932386108;6502.837429064311;6597.472202223907;6614.801555953329;6557.540972131905;6588.176477940257;6635.601863888182;6640;6671.666416679243;5689.402612725769;5849.561282903885;5916.49709774674;6016.7292471838;6052.061930400795;5908.084246941731;5953.940460595339;6017.06735456005;6096.573239873166;6157.507399407947 03:45:03 INFO - 2015-11-17 03:45:03,158 DEBUG : BROWSER_OUTPUT: |4;prototype.html;282.38017551474513;285.85707146426785;292.8535732133934;293.53474742533086;296.2046904062593;5669.801556945507;5719.256496655435;5771.711414429283;5801.47786699197;5809.477147056764;5696.629719068258;5766.942330576693;5787.855303617401;5807.448292412225;5811.593188476808;4302.548232435596;4325.351197320411;4329.004329004323;4337.826486940518;4340.240457919851;4094.4677191965;4190.784672444987;4252.787360631972;4311.482622085354;4314.676399270052;4215.831366745327;4262.808173632178;4268.253055715238;4275.9786201068955;4302.591253830897;4237.08902585944;4238.470191226097;4251.851185208534;4270.081932384521;4289.764062976535;3634.291313193928;3639;3647.1246900743895;3652.579953305351;3668.2663467306647;5427.810026649087;5491.341039075336;5527.2538207341895;5554.333479982428;5570.136628822539;4827.420709514846;4840.15297322967;4842;4842.104210720992;4848.296996935424;5916.290045194562;5946.70266486674;5951.4048595140575;5968.7910923117915;5989.251343582052;3937.3700207966876;3946.782926939017;3953.604639536052;3963.365861462181;3987.2424239394713;6102.0541816018585;6157.907631385533;6281.183446152017;6313.494920406357;6356;4017.015831121394;4046.393041043867;4052.63526282636;4053.3312003519677;4062.30940740069;4123.237201117803;4140.710150289511;4144.8134833932545;4154.833806647761;4155.127423241153;4802.351682522884;4815.109204797123;4826.1795494765975;4831.299461578052;4832.226843704991;5765.596408251382;5982.4017598239825;5992.64044157352;6007.279126504847;6015.939840601538;1428.4643258777958;1434.5194359889344;1439.4817865568386;1440.3230481673597;1440.985590144085;920.769807548113;923.4274749655123;941.4774799985937;942.9764255893657;947.6683160893632;5776.913346299809;5818.5636077294375;5831;5842.5618078644275;5847.181394604759;6191.783287584913;6272.560920735505;6272.937270627326;6296.244450665858;6328.873422531524;5900.734466948998;5906.40935906406;5912.379200184005;5926.703664816742;5940;3379.0369744622662;3420.401429749834;3420.9486857697157;3425.3491836550975;3427.7943323400177;6308.369163083655;6518.087467754518;6542.34576542342;6554.770583029571;6567.9671601641685;6419.550631455753;6424.38968298011;6447.80656580294;6455.386738259952;6456.418922297016;6508;6520.641364724891;6537.901931471032;6557.147570815763;6564.868702626016;6097.420745029215;6301.8109456716375;6307.463865571478;6308.148399965946;6310.148130002391;6147.907781383372;6166.321704612579;6175.320714721287;6187.81436556904;6196.938030619636;6451.258105317948;6471.029345598198;6484.870302594016;6497.252815926229;6512.6743662815725;4000.2199571084525;4051.1695102504505;4074.2055299216368;4082.4488694025927;4095.52901416329;6029.849253768691;6170.074488826712;6229.5327850410495;6261.624302541862;6311.715972781328;6073.787417440369;6099.634021958696;6115.755369785159;6120.602160859708;6121.173641558333;6063.393660633901;6078.3921607838865;6103.08453731926;6104.298005729398;6105.114758360101;5750.482456578928;5931.3178984417345;5963.493103086286;5970.253718285215;5986.4013598639785;6094.939050609437;6117.785877494266;6120.143179954899;6128.080787881853;6131.325554188947;5815.185873977731;5950.077737950624;5970.134330522137;5974.492168165754;5991.700414979146 03:45:03 INFO - 2015-11-17 03:45:03,160 DEBUG : BROWSER_OUTPUT: |5;yui.html;594.666986487567;656.9474442044634;677.5832862789384;693.1508901595549;731.4623751542618;10157.847632285513;10324.225683073762;10413.68758937232;10422.270441069128;10424.739381515456;9652.131308182263;9703.61185552577;9790;9814.656487022956;9826.410415375065;624.6033768556965;641.275358844505;779.8479296537178;797.3939805747644;803.3573141486817;760.0916904299364;775.3061010395693;778.0624347661055;783.7178615698344;786.6538722961907;812.8780682897553;815.7022686719364;819.2422009641058;821.8027673358381;824.2128767027505;810.2343285595115;811.395510344791;813.0365516862507;818.4761752478389;818.811673315135;600.807741522713;611.0620197996099;611.10778263735;611.4313688269907;617.8918689229367;9730.464824434654;9861.556229969668;9883;9884.851727224097;9895;9883.406995580288;10067.093961543424;10115.140213081897;10603.363798172135;10964.953913021709;7514.39884809214;7677.616119194074;7779.8444031119625;7813.882791758128;7878.921210787876;3000.4749168895573;3011.578379026938;3018.320877802477;3072.523758817387;3092.056922638594;43927.341089883674;44021.99999999968;44165.77917110394;45187;45466.772666136785;8004.5597492138495;8009.759707208793;8222.753317400488;8310.044344900292;8358.080611132771;17298.394556190473;17358.566035849206;17389.304427822997;17390.130493475277;17423.21595528204;5832.270966129234;5886.646801191942;5923.940760592425;5946.554008449383;6009.278886533644;3364.6635336466647;3380.4253276942486;3391.7795343302605;3420.0594836419687;3428.4171690812623;2633.4206474575944;2675.1172113202597;2677.6652918385203;2679.9196024119306;2681.0482278791137;376.1423953386284;378.4361301660506;380.6193806193806;380.6650147869912;381.6469765466932;427.2117942396274;498.8578255197251;502.54012094864476;527.2460381654271;535.8285348688382;6851;7029.3673569379;7118.537295075804;7235.782926512213;7724.536527808349;367.7609553790058;391.5262532335905;402.8610129505316;433.982640694375;452.31022690397407;3220.967790322067;3254.9674503254664;3608.783472991629;3623.4927110204594;3815.8664446744233;50392.49607503951;50678;50679.493205067476;50887;50897;46039;46950.76524617355;47055.76472117617;47093;47428.288575671395;40530.39204411936;41094.79452602778;41730;43540;43710.781446092566;7041.366277035091;7217.700813853557;7224.916262560658;7383.963080184565;7557.093148822177;31455.685443145274;32233.35533289368;32265.838670806497;32522.39820814282;32928;39482.802585988036;40632.39051414172;43173.78413107914;43261.78369108134;43644.56355436405;9525.476098814632;9708.611655533981;9802.166815820736;9817.165540929102;9958.651447199314;9433.811323773623;9615.23078153732;10290.073893349634;11043.944780276048;11055.00504954558;9295.76760580991;9519.714408567754;9831.705048848546;9839.803203936024;10166.339187952759;9469.715908522756;9497.762555936157;9703.611855525982;9864.457454840052;9902.603895844373;9445;9469.763255918657;9622.230221582397;9749.853752193581;10184.898151018691;7703.614819259126;7988.520688758693;8042.477238979448;8075.757727268191;8547.059823419544;7245.746398876014;7402.777916662509;7404.814879628052;7580.810479738051;7733.149353570991 03:45:03 INFO - 2015-11-17 03:45:03,160 DEBUG : BROWSER_OUTPUT: __end_tp_report 03:45:03 INFO - 2015-11-17 03:45:03,160 DEBUG : BROWSER_OUTPUT: __start_cc_report 03:45:03 INFO - 2015-11-17 03:45:03,160 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,284 03:45:03 INFO - 2015-11-17 03:45:03,161 DEBUG : BROWSER_OUTPUT: __end_cc_report 03:45:03 INFO - 2015-11-17 03:45:03,161 DEBUG : BROWSER_OUTPUT: __startTimestamp1447760703146__endTimestamp 03:45:03 INFO - 2015-11-17 03:45:03,161 DEBUG : BROWSER_OUTPUT: 03:45:03 INFO - 2015-11-17 03:45:03,161 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 03:45:03 INFO - 2015-11-17 03:45:03,161 DEBUG : BROWSER_OUTPUT: Number of tests: 6 03:45:03 INFO - 2015-11-17 03:45:03,162 DEBUG : BROWSER_OUTPUT: 03:45:03 INFO - 2015-11-17 03:45:03,162 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4785.22 Median:4929.85 stddev:622.92 (12.6%) stddev-sans-first:606.65 03:45:03 INFO - 2015-11-17 03:45:03,163 DEBUG : BROWSER_OUTPUT: Values: 2880.4 2888.4 2942.2 2943.7 3002.7 4732.6 4790.8 4795.1 4856.3 4880.6 4646.8 4732.6 4777.8 4816.0 4865.8 4425.4 4461.5 4495.1 4501.7 4522.4 123.6 4475.4 4504.2 4552.2 4575.0 4491.4 4494.1 4539.3 4557.3 4569.7 4468.2 4531.3 4536.9 4546.1 4581.2 4335.5 4343.0 4446.4 4448.6 4459.8 4686.6 4730.4 4762.0 4772.2 4845.0 5105.4 5149.0 5156.5 5160.9 5213.3 5042.7 5085.0 5168.8 5183.0 5226.5 4686.9 4812.4 4852.3 4852.9 4922.6 5175.0 5178.9 5269.6 5275.4 5324.6 4949.3 4982.4 5014.0 5033.5 5081.7 5187.1 5193.2 5210.3 5261.2 5288.8 4925.9 5050.2 5122.1 5126.2 5142.2 4920.8 5094.6 5100.1 5106.4 5156.2 3979.6 4002.9 4020.3 4026.2 4067.3 3498.0 3503.6 3535.9 3640.9 3677.2 4891.7 4898.7 4916.6 4925.6 4950.0 5186.3 5190.1 5192.8 5197.3 5218.7 4814.4 4849.9 4872.3 4905.7 4958.8 4537.9 4564.6 4595.3 4606.7 4619.3 5282.6 5289.8 5321.5 5334.4 5343.6 5052.5 5066.5 5088.2 5132.1 5201.7 5306.9 5308.6 5316.8 5360.1 5367.7 4903.9 5168.7 5170.9 5197.8 5216.8 5111.0 5158.6 5183.2 5188.8 5199.6 5071.9 5088.3 5097.2 5102.8 5136.4 4929.9 5008.4 5046.8 5053.6 5113.9 4838.3 4887.0 4895.4 4953.3 5015.0 5045.1 5055.6 5099.0 5116.0 5117.9 4800.5 4882.1 4912.8 5012.4 5043.5 03:45:03 INFO - 2015-11-17 03:45:03,163 DEBUG : BROWSER_OUTPUT: 03:45:03 INFO - 2015-11-17 03:45:03,163 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:40145.63 Median:34789.74 stddev:64035.81 (184.1%) stddev-sans-first:64146.23 03:45:03 INFO - 2015-11-17 03:45:03,165 DEBUG : BROWSER_OUTPUT: Values: 491.6 506.1 509.8 523.0 526.3 34804.5 35585.3 35610.3 35696.5 35738.1 37197.3 37744.8 37864.6 37868.8 37916.6 8285.4 8464.3 8479.6 8483.5 8484.7 8254.0 8376.8 8386.4 8388.7 8389.4 8152.2 8182.7 8322.1 8323.7 8381.1 8359.5 8397.2 8439.7 8471.1 8476.4 8038.4 8170.0 8267.0 8278.3 8280.4 34510.0 35403.0 35457.5 35472.5 35511.6 2204.6 2378.6 2587.1 2645.7 2758.7 23841.6 24303.1 24304.4 24326.9 24498.1 2034.9 2083.7 2091.8 2095.4 2219.6 209134.0 209511.0 209667.0 210039.0 210418.0 43770.3 45335.1 50153.2 50558.0 50984.5 47291.0 47352.1 47392.5 47398.8 47423.5 14162.2 14213.8 14315.3 14420.9 14461.2 11076.8 11132.5 11188.0 11260.6 11262.8 16484.4 16837.2 16869.7 16910.7 16926.5 7828.1 8048.9 8068.9 8086.8 8100.1 820.8 837.3 877.3 903.3 936.1 23009.2 23578.2 23629.5 24510.3 24564.9 922.6 938.1 961.2 1022.6 1060.7 12140.4 12278.3 12434.4 12495.2 12509.1 285739.0 289236.0 289360.0 289871.0 293116.0 44906.8 45307.0 45323.0 45344.5 45461.0 1242.1 1252.3 1258.9 1263.4 1278.2 23495.4 25223.5 25559.4 25854.5 25876.2 41354.4 41815.2 41836.0 41984.8 42028.8 225042.0 232415.0 232417.0 232808.0 233159.0 26833.0 39175.8 40644.8 40939.8 41077.0 40274.2 41637.0 41654.4 41869.0 42139.8 33553.0 33827.5 34356.5 34742.7 35023.8 34264.3 34319.8 34523.8 34635.7 34775.0 34223.3 34268.5 34745.1 35264.1 35493.8 30657.7 31495.2 31708.5 31766.5 31855.0 22899.0 23360.3 23656.8 23665.9 23700.6 03:45:03 INFO - 2015-11-17 03:45:03,165 DEBUG : BROWSER_OUTPUT: 03:45:03 INFO - 2015-11-17 03:45:03,165 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:23500.13 Median:4377.69 stddev:79265.18 (1810.7%) stddev-sans-first:79468.38 03:45:03 INFO - 2015-11-17 03:45:03,166 DEBUG : BROWSER_OUTPUT: Values: 292.8 301.1 306.6 307.3 312.4 10536.5 10948.5 15398.0 15410.3 15946.9 10143.4 10211.6 10565.6 10566.0 10586.7 3887.5 3964.9 4005.2 4014.6 4018.8 3963.9 3987.8 4012.4 4015.7 4073.9 3022.9 3040.1 4048.3 4060.1 4070.2 4203.2 4337.2 4369.8 4377.4 4378.0 3617.2 3657.8 3661.3 3704.2 3714.7 11808.4 12101.5 12106.0 12206.0 12221.3 1728.9 1735.5 1741.9 1774.1 1831.9 8418.4 8434.0 8588.4 8706.2 8724.3 1356.1 1391.3 1392.9 1426.9 1446.2 50435.0 52687.7 53183.5 53581.7 53917.5 5762.5 5790.2 5841.4 5858.4 5924.4 6699.3 6704.2 6774.6 6775.2 6780.6 4810.0 4879.5 4915.1 4923.1 4934.6 5202.9 5250.3 5250.9 5277.7 5281.9 2625.5 2627.9 2645.2 2657.5 2679.7 912.1 921.4 922.8 929.3 982.1 372.4 384.3 397.4 402.6 410.8 8908.9 10399.5 10675.6 10711.5 10792.8 393.0 396.9 399.7 408.2 413.8 5511.9 5706.2 5746.2 5787.0 5892.3 473253.0 480978.0 485989.0 488766.0 491393.0 59784.0 61745.0 61795.7 63156.4 64194.0 431.4 444.4 445.2 449.2 449.9 9601.5 9640.1 9914.6 10044.3 10152.6 27603.7 28716.0 29012.7 29263.3 29947.6 36802.6 37030.3 37157.3 39434.6 40614.0 5582.2 5608.4 5652.6 5713.9 5720.4 10558.4 10635.0 10749.8 10756.6 10841.7 9136.9 9263.5 9300.7 9359.3 9363.3 7805.7 8818.3 9026.8 9072.2 9349.5 9240.7 9306.3 9479.3 9513.0 9521.6 5477.4 5576.8 5641.9 5641.9 5645.2 8839.9 9065.7 9229.2 9244.0 9439.2 03:45:03 INFO - 2015-11-17 03:45:03,166 DEBUG : BROWSER_OUTPUT: 03:45:03 INFO - 2015-11-17 03:45:03,166 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5079.81 Median:6227.74 stddev:2621.81 (42.1%) stddev-sans-first:2615.03 03:45:03 INFO - 2015-11-17 03:45:03,168 DEBUG : BROWSER_OUTPUT: Values: 1458.5 1553.6 1585.1 1594.6 1621.9 6388.7 6644.7 6967.2 7439.0 7450.0 7200.5 7277.0 7416.0 7480.4 7492.3 2011.1 2048.9 2070.6 2072.4 2073.2 2014.6 2024.3 2058.6 2075.3 2097.4 2010.1 2015.3 2041.5 2046.5 2064.2 2014.7 2036.4 2040.9 2064.0 2065.4 1979.0 1985.1 1987.6 2005.6 2009.8 7297.6 7312.0 7317.0 7424.0 7434.7 4343.3 4359.1 4390.3 4432.5 4432.7 2364.6 2466.0 2641.0 2705.3 2709.4 773.1 804.4 806.2 810.1 818.4 8943.8 9079.3 9105.6 9173.7 9206.3 3953.6 3981.4 4039.2 4089.4 4100.4 8471.6 8560.4 8604.9 8648.7 8668.5 4470.5 4483.8 4496.5 4518.9 4547.2 4068.2 4071.1 4100.4 4101.5 4115.4 3423.1 3507.6 3520.2 3530.3 3538.4 1110.4 1117.4 1122.6 1123.2 1133.8 945.9 961.2 1180.6 1194.0 1200.3 6894.7 6931.7 6944.8 6961.4 6986.5 1075.0 1103.4 1124.1 1133.2 1138.9 5353.5 5432.0 5444.5 5491.8 5503.7 8453.7 8808.6 8838.5 8857.6 8956.3 8720.6 8776.0 8783.2 8812.9 8833.8 6814.9 6845.8 6931.3 6942.3 6959.3 6634.2 6662.6 6674.5 6699.6 6700.6 7534.5 7832.7 7834.5 7888.9 7954.5 7863.9 8099.7 8113.7 8122.1 8204.4 6185.7 6206.3 6249.2 6409.4 6486.5 7048.3 7086.5 7101.6 7103.3 7140.8 6587.4 6618.8 6648.5 6703.8 6729.8 6118.8 6467.4 6502.8 6597.5 6614.8 6557.5 6588.2 6635.6 6640.0 6671.7 5689.4 5849.6 5916.5 6016.7 6052.1 5908.1 5953.9 6017.1 6096.6 6157.5 03:45:03 INFO - 2015-11-17 03:45:03,168 DEBUG : BROWSER_OUTPUT: 03:45:03 INFO - 2015-11-17 03:45:03,168 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5018.31 Median:5836.78 stddev:1570.03 (26.9%) stddev-sans-first:1533.66 03:45:03 INFO - 2015-11-17 03:45:03,170 DEBUG : BROWSER_OUTPUT: Values: 282.4 285.9 292.9 293.5 296.2 5669.8 5719.3 5771.7 5801.5 5809.5 5696.6 5766.9 5787.9 5807.4 5811.6 4302.5 4325.4 4329.0 4337.8 4340.2 4094.5 4190.8 4252.8 4311.5 4314.7 4215.8 4262.8 4268.3 4276.0 4302.6 4237.1 4238.5 4251.9 4270.1 4289.8 3634.3 3639.0 3647.1 3652.6 3668.3 5427.8 5491.3 5527.3 5554.3 5570.1 4827.4 4840.2 4842.0 4842.1 4848.3 5916.3 5946.7 5951.4 5968.8 5989.3 3937.4 3946.8 3953.6 3963.4 3987.2 6102.1 6157.9 6281.2 6313.5 6356.0 4017.0 4046.4 4052.6 4053.3 4062.3 4123.2 4140.7 4144.8 4154.8 4155.1 4802.4 4815.1 4826.2 4831.3 4832.2 5765.6 5982.4 5992.6 6007.3 6015.9 1428.5 1434.5 1439.5 1440.3 1441.0 920.8 923.4 941.5 943.0 947.7 5776.9 5818.6 5831.0 5842.6 5847.2 6191.8 6272.6 6272.9 6296.2 6328.9 5900.7 5906.4 5912.4 5926.7 5940.0 3379.0 3420.4 3420.9 3425.3 3427.8 6308.4 6518.1 6542.3 6554.8 6568.0 6419.6 6424.4 6447.8 6455.4 6456.4 6508.0 6520.6 6537.9 6557.1 6564.9 6097.4 6301.8 6307.5 6308.1 6310.1 6147.9 6166.3 6175.3 6187.8 6196.9 6451.3 6471.0 6484.9 6497.3 6512.7 4000.2 4051.2 4074.2 4082.4 4095.5 6029.8 6170.1 6229.5 6261.6 6311.7 6073.8 6099.6 6115.8 6120.6 6121.2 6063.4 6078.4 6103.1 6104.3 6105.1 5750.5 5931.3 5963.5 5970.3 5986.4 6094.9 6117.8 6120.1 6128.1 6131.3 5815.2 5950.1 5970.1 5974.5 5991.7 03:45:03 INFO - 2015-11-17 03:45:03,170 DEBUG : BROWSER_OUTPUT: 03:45:03 INFO - 2015-11-17 03:45:03,170 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:12100.20 Median:3310.17 stddev:14665.00 (443.0%) stddev-sans-first:14680.69 03:45:03 INFO - 2015-11-17 03:45:03,171 DEBUG : BROWSER_OUTPUT: Values: 594.7 656.9 677.6 693.2 731.5 10157.8 10324.2 10413.7 10422.3 10424.7 9652.1 9703.6 9790.0 9814.7 9826.4 624.6 641.3 779.8 797.4 803.4 760.1 775.3 778.1 783.7 786.7 812.9 815.7 819.2 821.8 824.2 810.2 811.4 813.0 818.5 818.8 600.8 611.1 611.1 611.4 617.9 9730.5 9861.6 9883.0 9884.9 9895.0 9883.4 10067.1 10115.1 10603.4 10965.0 7514.4 7677.6 7779.8 7813.9 7878.9 3000.5 3011.6 3018.3 3072.5 3092.1 43927.3 44022.0 44165.8 45187.0 45466.8 8004.6 8009.8 8222.8 8310.0 8358.1 17298.4 17358.6 17389.3 17390.1 17423.2 5832.3 5886.6 5923.9 5946.6 6009.3 3364.7 3380.4 3391.8 3420.1 3428.4 2633.4 2675.1 2677.7 2679.9 2681.0 376.1 378.4 380.6 380.7 381.6 427.2 498.9 502.5 527.2 535.8 6851.0 7029.4 7118.5 7235.8 7724.5 367.8 391.5 402.9 434.0 452.3 3221.0 3255.0 3608.8 3623.5 3815.9 50392.5 50678.0 50679.5 50887.0 50897.0 46039.0 46950.8 47055.8 47093.0 47428.3 40530.4 41094.8 41730.0 43540.0 43710.8 7041.4 7217.7 7224.9 7384.0 7557.1 31455.7 32233.4 32265.8 32522.4 32928.0 39482.8 40632.4 43173.8 43261.8 43644.6 9525.5 9708.6 9802.2 9817.2 9958.7 9433.8 9615.2 10290.1 11043.9 11055.0 9295.8 9519.7 9831.7 9839.8 10166.3 9469.7 9497.8 9703.6 9864.5 9902.6 9445.0 9469.8 9622.2 9749.9 10184.9 7703.6 7988.5 8042.5 8075.8 8547.1 7245.7 7402.8 7404.8 7580.8 7733.1 03:45:03 INFO - 2015-11-17 03:45:03,172 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 03:45:03 INFO - 2015-11-17 03:45:03,172 DEBUG : BROWSER_OUTPUT: 03:45:03 INFO - 2015-11-17 03:45:03,600 INFO : Browser exited with error code: 0 03:45:03 INFO - 2015-11-17 03:45:03,631 INFO : Completed test dromaeo_css (00:18:30) 03:45:03 INFO - 2015-11-17 03:45:03,631 INFO : Starting test kraken 03:45:03 INFO - 2015-11-17 03:45:03,631 DEBUG : operating with platform_type : mac_ 03:45:03 INFO - 2015-11-17 03:45:03,631 INFO : Initialising browser for kraken test... 03:45:03 INFO - 2015-11-17 03:45:03,645 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/tmpoFourK/profile http://localhost:50965/getInfo.html 03:45:06 INFO - 2015-11-17 03:45:06,724 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 03:45:06 INFO - 2015-11-17 03:45:06,724 DEBUG : BROWSER_OUTPUT: colorDepth:24 03:45:06 INFO - 2015-11-17 03:45:06,724 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 03:45:06 INFO - 2015-11-17 03:45:06,724 DEBUG : BROWSER_OUTPUT: __metrics 03:45:07 INFO - 2015-11-17 03:45:07,389 INFO : Browser initialized. 03:45:07 INFO - 2015-11-17 03:45:07,389 INFO : Running cycle 1/1 for kraken test... 03:45:07 INFO - 2015-11-17 03:45:07,389 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/tmpoFourK/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 03:45:19 INFO - 2015-11-17 03:45:19,523 DEBUG : BROWSER_OUTPUT: RSS: Main: 241168384 03:45:19 INFO - 2015-11-17 03:45:19,523 DEBUG : BROWSER_OUTPUT: 03:45:22 INFO - 2015-11-17 03:45:22,192 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50965/tests/kraken/driver.html?testName=audio-beat-detection) 03:45:22 INFO - 2015-11-17 03:45:22,796 DEBUG : BROWSER_OUTPUT: RSS: Main: 259166208 03:45:22 INFO - 2015-11-17 03:45:22,796 DEBUG : BROWSER_OUTPUT: 03:45:25 INFO - 2015-11-17 03:45:25,687 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50965/tests/kraken/driver.html?testName=audio-dft) 03:45:26 INFO - 2015-11-17 03:45:26,293 DEBUG : BROWSER_OUTPUT: RSS: Main: 267771904 03:45:26 INFO - 2015-11-17 03:45:26,294 DEBUG : BROWSER_OUTPUT: 03:45:29 INFO - 2015-11-17 03:45:29,485 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50965/tests/kraken/driver.html?testName=audio-fft) 03:45:30 INFO - 2015-11-17 03:45:30,079 DEBUG : BROWSER_OUTPUT: RSS: Main: 267497472 03:45:30 INFO - 2015-11-17 03:45:30,079 DEBUG : BROWSER_OUTPUT: 03:45:32 INFO - 2015-11-17 03:45:32,220 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50965/tests/kraken/driver.html?testName=audio-oscillator) 03:45:32 INFO - 2015-11-17 03:45:32,814 DEBUG : BROWSER_OUTPUT: RSS: Main: 267632640 03:45:32 INFO - 2015-11-17 03:45:32,814 DEBUG : BROWSER_OUTPUT: 03:45:35 INFO - 2015-11-17 03:45:35,106 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50965/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:45:35 INFO - 2015-11-17 03:45:35,681 DEBUG : BROWSER_OUTPUT: RSS: Main: 268300288 03:45:35 INFO - 2015-11-17 03:45:35,681 DEBUG : BROWSER_OUTPUT: 03:45:39 INFO - 2015-11-17 03:45:39,031 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50965/tests/kraken/driver.html?testName=imaging-darkroom) 03:45:39 INFO - 2015-11-17 03:45:39,619 DEBUG : BROWSER_OUTPUT: RSS: Main: 267350016 03:45:39 INFO - 2015-11-17 03:45:39,619 DEBUG : BROWSER_OUTPUT: 03:45:43 INFO - 2015-11-17 03:45:43,071 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50965/tests/kraken/driver.html?testName=imaging-desaturate) 03:45:43 INFO - 2015-11-17 03:45:43,662 DEBUG : BROWSER_OUTPUT: RSS: Main: 268496896 03:45:43 INFO - 2015-11-17 03:45:43,662 DEBUG : BROWSER_OUTPUT: 03:45:46 INFO - 2015-11-17 03:45:46,796 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50965/tests/kraken/driver.html?testName=json-parse-financial) 03:45:47 INFO - 2015-11-17 03:45:47,391 DEBUG : BROWSER_OUTPUT: RSS: Main: 267685888 03:45:47 INFO - 2015-11-17 03:45:47,392 DEBUG : BROWSER_OUTPUT: 03:45:49 INFO - 2015-11-17 03:45:49,090 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50965/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:45:49 INFO - 2015-11-17 03:45:49,665 DEBUG : BROWSER_OUTPUT: RSS: Main: 268808192 03:45:49 INFO - 2015-11-17 03:45:49,665 DEBUG : BROWSER_OUTPUT: 03:45:51 INFO - 2015-11-17 03:45:51,621 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50965/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:45:52 INFO - 2015-11-17 03:45:52,248 DEBUG : BROWSER_OUTPUT: RSS: Main: 269037568 03:45:52 INFO - 2015-11-17 03:45:52,248 DEBUG : BROWSER_OUTPUT: 03:45:54 INFO - 2015-11-17 03:45:54,504 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50965/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:45:55 INFO - 2015-11-17 03:45:55,097 DEBUG : BROWSER_OUTPUT: RSS: Main: 269680640 03:45:55 INFO - 2015-11-17 03:45:55,097 DEBUG : BROWSER_OUTPUT: 03:45:57 INFO - 2015-11-17 03:45:57,948 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50965/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:45:58 INFO - 2015-11-17 03:45:58,537 DEBUG : BROWSER_OUTPUT: RSS: Main: 269307904 03:45:58 INFO - 2015-11-17 03:45:58,537 DEBUG : BROWSER_OUTPUT: 03:46:01 INFO - 2015-11-17 03:46:01,390 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50965/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:46:01 INFO - 2015-11-17 03:46:01,978 DEBUG : BROWSER_OUTPUT: RSS: Main: 269180928 03:46:01 INFO - 2015-11-17 03:46:01,978 DEBUG : BROWSER_OUTPUT: 03:46:03 INFO - 2015-11-17 03:46:03,813 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50965/tests/kraken/driver.html?testName=ai-astar) 03:46:04 INFO - 2015-11-17 03:46:04,056 DEBUG : BROWSER_OUTPUT: RSS: Main: 269479936 03:46:04 INFO - 2015-11-17 03:46:04,056 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,056 DEBUG : BROWSER_OUTPUT: __start_tp_report 03:46:04 INFO - 2015-11-17 03:46:04,056 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 03:46:04 INFO - 2015-11-17 03:46:04,057 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 03:46:04 INFO - 2015-11-17 03:46:04,057 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 03:46:04 INFO - 2015-11-17 03:46:04,057 DEBUG : BROWSER_OUTPUT: |0;ai-astar;119;101;115;119;114;126;122;121;127;127 03:46:04 INFO - 2015-11-17 03:46:04,057 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;166;147;174;187;150;165;163;151;187;155 03:46:04 INFO - 2015-11-17 03:46:04,057 DEBUG : BROWSER_OUTPUT: |2;audio-dft;179;184;184;241;213;191;186;185;190;190 03:46:04 INFO - 2015-11-17 03:46:04,057 DEBUG : BROWSER_OUTPUT: |3;audio-fft;75;81;97;133;79;79;81;84;134;78 03:46:04 INFO - 2015-11-17 03:46:04,057 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;97;100;142;102;104;104;142;103;101;139 03:46:04 INFO - 2015-11-17 03:46:04,058 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;137;136;143;130;143;136;139;136;143;142 03:46:04 INFO - 2015-11-17 03:46:04,058 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;139;149;149;149;144;150;149;149;144;150 03:46:04 INFO - 2015-11-17 03:46:04,058 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;122;113;112;113;123;114;113;112;123;122 03:46:04 INFO - 2015-11-17 03:46:04,058 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;68;68;70;72;74;73;74;82;73;74 03:46:04 INFO - 2015-11-17 03:46:04,058 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;71;79;81;81;81;81;83;81;79;78 03:46:04 INFO - 2015-11-17 03:46:04,058 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;97;101;101;101;102;102;104;102;100;97 03:46:04 INFO - 2015-11-17 03:46:04,059 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;155;157;149;147;147;158;151;158;149;150 03:46:04 INFO - 2015-11-17 03:46:04,059 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;160;176;182;190;174;158;162;182;184;176 03:46:04 INFO - 2015-11-17 03:46:04,060 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;74;80;82;82;85;84;83;82;80;84 03:46:04 INFO - 2015-11-17 03:46:04,060 DEBUG : BROWSER_OUTPUT: __end_tp_report 03:46:04 INFO - 2015-11-17 03:46:04,061 DEBUG : BROWSER_OUTPUT: __start_cc_report 03:46:04 INFO - 2015-11-17 03:46:04,061 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,727 03:46:04 INFO - 2015-11-17 03:46:04,061 DEBUG : BROWSER_OUTPUT: __end_cc_report 03:46:04 INFO - 2015-11-17 03:46:04,061 DEBUG : BROWSER_OUTPUT: __startTimestamp1447760764055__endTimestamp 03:46:04 INFO - 2015-11-17 03:46:04,061 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,061 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 03:46:04 INFO - 2015-11-17 03:46:04,062 DEBUG : BROWSER_OUTPUT: Number of tests: 14 03:46:04 INFO - 2015-11-17 03:46:04,062 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,062 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:119.10 Median:121.50 stddev:7.85 (6.5%) stddev-sans-first:8.33 03:46:04 INFO - 2015-11-17 03:46:04,062 DEBUG : BROWSER_OUTPUT: Values: 119.0 101.0 115.0 119.0 114.0 126.0 122.0 121.0 127.0 127.0 03:46:04 INFO - 2015-11-17 03:46:04,062 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,063 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:164.50 Median:165.50 stddev:14.52 (8.8%) stddev-sans-first:15.39 03:46:04 INFO - 2015-11-17 03:46:04,063 DEBUG : BROWSER_OUTPUT: Values: 166.0 147.0 174.0 187.0 150.0 165.0 163.0 151.0 187.0 155.0 03:46:04 INFO - 2015-11-17 03:46:04,063 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,063 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:194.30 Median:190.00 stddev:18.80 (9.9%) stddev-sans-first:19.10 03:46:04 INFO - 2015-11-17 03:46:04,063 DEBUG : BROWSER_OUTPUT: Values: 179.0 184.0 184.0 241.0 213.0 191.0 186.0 185.0 190.0 190.0 03:46:04 INFO - 2015-11-17 03:46:04,065 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,065 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:92.10 Median:80.00 stddev:22.61 (28.3%) stddev-sans-first:23.11 03:46:04 INFO - 2015-11-17 03:46:04,065 DEBUG : BROWSER_OUTPUT: Values: 75.0 81.0 97.0 133.0 79.0 79.0 81.0 84.0 134.0 78.0 03:46:04 INFO - 2015-11-17 03:46:04,065 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,066 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:113.40 Median:121.50 stddev:19.17 (15.8%) stddev-sans-first:19.40 03:46:04 INFO - 2015-11-17 03:46:04,066 DEBUG : BROWSER_OUTPUT: Values: 97.0 100.0 142.0 102.0 104.0 104.0 142.0 103.0 101.0 139.0 03:46:04 INFO - 2015-11-17 03:46:04,066 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,066 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:138.50 Median:140.50 stddev:4.30 (3.1%) stddev-sans-first:4.53 03:46:04 INFO - 2015-11-17 03:46:04,066 DEBUG : BROWSER_OUTPUT: Values: 137.0 136.0 143.0 130.0 143.0 136.0 139.0 136.0 143.0 142.0 03:46:04 INFO - 2015-11-17 03:46:04,067 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,067 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:147.20 Median:149.00 stddev:3.65 (2.4%) stddev-sans-first:2.37 03:46:04 INFO - 2015-11-17 03:46:04,067 DEBUG : BROWSER_OUTPUT: Values: 139.0 149.0 149.0 149.0 144.0 150.0 149.0 149.0 144.0 150.0 03:46:04 INFO - 2015-11-17 03:46:04,067 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,067 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:116.70 Median:118.00 stddev:5.03 (4.3%) stddev-sans-first:4.96 03:46:04 INFO - 2015-11-17 03:46:04,067 DEBUG : BROWSER_OUTPUT: Values: 122.0 113.0 112.0 113.0 123.0 114.0 113.0 112.0 123.0 122.0 03:46:04 INFO - 2015-11-17 03:46:04,068 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,068 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:72.80 Median:73.50 stddev:3.99 (5.4%) stddev-sans-first:3.84 03:46:04 INFO - 2015-11-17 03:46:04,068 DEBUG : BROWSER_OUTPUT: Values: 68.0 68.0 70.0 72.0 74.0 73.0 74.0 82.0 73.0 74.0 03:46:04 INFO - 2015-11-17 03:46:04,068 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,068 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:79.50 Median:81.00 stddev:3.31 (4.1%) stddev-sans-first:1.51 03:46:04 INFO - 2015-11-17 03:46:04,068 DEBUG : BROWSER_OUTPUT: Values: 71.0 79.0 81.0 81.0 81.0 81.0 83.0 81.0 79.0 78.0 03:46:04 INFO - 2015-11-17 03:46:04,068 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,069 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:100.70 Median:102.00 stddev:2.21 (2.2%) stddev-sans-first:1.90 03:46:04 INFO - 2015-11-17 03:46:04,069 DEBUG : BROWSER_OUTPUT: Values: 97.0 101.0 101.0 101.0 102.0 102.0 104.0 102.0 100.0 97.0 03:46:04 INFO - 2015-11-17 03:46:04,069 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,069 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:152.10 Median:153.00 stddev:4.46 (2.9%) stddev-sans-first:4.60 03:46:04 INFO - 2015-11-17 03:46:04,069 DEBUG : BROWSER_OUTPUT: Values: 155.0 157.0 149.0 147.0 147.0 158.0 151.0 158.0 149.0 150.0 03:46:04 INFO - 2015-11-17 03:46:04,069 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,070 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:174.40 Median:179.00 stddev:10.99 (6.1%) stddev-sans-first:10.34 03:46:04 INFO - 2015-11-17 03:46:04,070 DEBUG : BROWSER_OUTPUT: Values: 160.0 176.0 182.0 190.0 174.0 158.0 162.0 182.0 184.0 176.0 03:46:04 INFO - 2015-11-17 03:46:04,070 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,070 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:81.60 Median:82.50 stddev:3.13 (3.8%) stddev-sans-first:1.74 03:46:04 INFO - 2015-11-17 03:46:04,070 DEBUG : BROWSER_OUTPUT: Values: 74.0 80.0 82.0 82.0 85.0 84.0 83.0 82.0 80.0 84.0 03:46:04 INFO - 2015-11-17 03:46:04,070 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 03:46:04 INFO - 2015-11-17 03:46:04,070 DEBUG : BROWSER_OUTPUT: 03:46:04 INFO - 2015-11-17 03:46:04,777 INFO : Browser exited with error code: 0 03:46:04 INFO - 2015-11-17 03:46:04,828 INFO : Completed test kraken (00:01:01) 03:46:04 INFO - 2015-11-17 03:46:04,828 INFO : Starting test v8_7 03:46:04 INFO - 2015-11-17 03:46:04,828 DEBUG : operating with platform_type : mac_ 03:46:04 INFO - 2015-11-17 03:46:04,828 INFO : Initialising browser for v8_7 test... 03:46:04 INFO - 2015-11-17 03:46:04,842 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/tmpq4k8Yp/profile http://localhost:50965/getInfo.html 03:46:07 INFO - 2015-11-17 03:46:07,875 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 03:46:07 INFO - 2015-11-17 03:46:07,876 DEBUG : BROWSER_OUTPUT: colorDepth:24 03:46:07 INFO - 2015-11-17 03:46:07,876 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 03:46:07 INFO - 2015-11-17 03:46:07,876 DEBUG : BROWSER_OUTPUT: __metrics 03:46:08 INFO - 2015-11-17 03:46:08,575 INFO : Browser initialized. 03:46:08 INFO - 2015-11-17 03:46:08,575 INFO : Running cycle 1/1 for v8_7 test... 03:46:08 INFO - 2015-11-17 03:46:08,575 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/T/tmpq4k8Yp/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 03:46:20 INFO - 2015-11-17 03:46:20,663 DEBUG : BROWSER_OUTPUT: RSS: Main: 242233344 03:46:20 INFO - 2015-11-17 03:46:20,663 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,211 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50965/tests/v8_7/run.html (next: http://localhost:50965/tests/v8_7/run.html) 03:46:42 INFO - 2015-11-17 03:46:42,469 DEBUG : BROWSER_OUTPUT: RSS: Main: 259883008 03:46:42 INFO - 2015-11-17 03:46:42,470 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,470 DEBUG : BROWSER_OUTPUT: __start_tp_report 03:46:42 INFO - 2015-11-17 03:46:42,470 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 03:46:42 INFO - 2015-11-17 03:46:42,470 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 03:46:42 INFO - 2015-11-17 03:46:42,470 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 03:46:42 INFO - 2015-11-17 03:46:42,470 DEBUG : BROWSER_OUTPUT: |0;Richards;182.5150574922431 03:46:42 INFO - 2015-11-17 03:46:42,470 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;222.17285047767163 03:46:42 INFO - 2015-11-17 03:46:42,471 DEBUG : BROWSER_OUTPUT: |2;Encrypt;357.5259206292456 03:46:42 INFO - 2015-11-17 03:46:42,471 DEBUG : BROWSER_OUTPUT: |3;Decrypt;6555.555555555556 03:46:42 INFO - 2015-11-17 03:46:42,471 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1264.2225031605562 03:46:42 INFO - 2015-11-17 03:46:42,471 DEBUG : BROWSER_OUTPUT: |5;Earley;915.7509157509157 03:46:42 INFO - 2015-11-17 03:46:42,471 DEBUG : BROWSER_OUTPUT: |6;Boyer;15134.328358208955 03:46:42 INFO - 2015-11-17 03:46:42,471 DEBUG : BROWSER_OUTPUT: |7;RegExp;31968.75 03:46:42 INFO - 2015-11-17 03:46:42,471 DEBUG : BROWSER_OUTPUT: |8;Splay;707.7140835102618 03:46:42 INFO - 2015-11-17 03:46:42,472 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;6451.612903225807 03:46:42 INFO - 2015-11-17 03:46:42,472 DEBUG : BROWSER_OUTPUT: __end_tp_report 03:46:42 INFO - 2015-11-17 03:46:42,472 DEBUG : BROWSER_OUTPUT: __startTimestamp1447760802465__endTimestamp 03:46:42 INFO - 2015-11-17 03:46:42,472 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,472 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 03:46:42 INFO - 2015-11-17 03:46:42,472 DEBUG : BROWSER_OUTPUT: Number of tests: 10 03:46:42 INFO - 2015-11-17 03:46:42,472 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,472 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:182.52 Median:182.52 stddev:0.00 (0.0%) 03:46:42 INFO - 2015-11-17 03:46:42,472 DEBUG : BROWSER_OUTPUT: Values: 182.5 03:46:42 INFO - 2015-11-17 03:46:42,473 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,473 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:222.17 Median:222.17 stddev:0.00 (0.0%) 03:46:42 INFO - 2015-11-17 03:46:42,473 DEBUG : BROWSER_OUTPUT: Values: 222.2 03:46:42 INFO - 2015-11-17 03:46:42,473 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,473 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:357.53 Median:357.53 stddev:0.00 (0.0%) 03:46:42 INFO - 2015-11-17 03:46:42,473 DEBUG : BROWSER_OUTPUT: Values: 357.5 03:46:42 INFO - 2015-11-17 03:46:42,473 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,474 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:6555.56 Median:6555.56 stddev:0.00 (0.0%) 03:46:42 INFO - 2015-11-17 03:46:42,474 DEBUG : BROWSER_OUTPUT: Values: 6555.6 03:46:42 INFO - 2015-11-17 03:46:42,474 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,474 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1264.22 Median:1264.22 stddev:0.00 (0.0%) 03:46:42 INFO - 2015-11-17 03:46:42,474 DEBUG : BROWSER_OUTPUT: Values: 1264.2 03:46:42 INFO - 2015-11-17 03:46:42,474 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,474 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:915.75 Median:915.75 stddev:0.00 (0.0%) 03:46:42 INFO - 2015-11-17 03:46:42,474 DEBUG : BROWSER_OUTPUT: Values: 915.8 03:46:42 INFO - 2015-11-17 03:46:42,475 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,475 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:15134.33 Median:15134.33 stddev:0.00 (0.0%) 03:46:42 INFO - 2015-11-17 03:46:42,475 DEBUG : BROWSER_OUTPUT: Values: 15134.3 03:46:42 INFO - 2015-11-17 03:46:42,475 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,475 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:31968.75 Median:31968.75 stddev:0.00 (0.0%) 03:46:42 INFO - 2015-11-17 03:46:42,475 DEBUG : BROWSER_OUTPUT: Values: 31968.8 03:46:42 INFO - 2015-11-17 03:46:42,475 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,475 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:707.71 Median:707.71 stddev:0.00 (0.0%) 03:46:42 INFO - 2015-11-17 03:46:42,475 DEBUG : BROWSER_OUTPUT: Values: 707.7 03:46:42 INFO - 2015-11-17 03:46:42,476 DEBUG : BROWSER_OUTPUT: 03:46:42 INFO - 2015-11-17 03:46:42,476 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:6451.61 Median:6451.61 stddev:0.00 (0.0%) 03:46:42 INFO - 2015-11-17 03:46:42,476 DEBUG : BROWSER_OUTPUT: Values: 6451.6 03:46:42 INFO - 2015-11-17 03:46:42,476 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 03:46:42 INFO - 2015-11-17 03:46:42,476 DEBUG : BROWSER_OUTPUT: 03:46:43 INFO - 2015-11-17 03:46:43,166 INFO : Browser exited with error code: 0 03:46:43 INFO - 2015-11-17 03:46:43,187 INFO : Completed test v8_7 (00:00:38) 03:46:43 INFO - 2015-11-17 03:46:43,459 INFO : Completed test suite (00:20:10) 03:46:43 INFO - 2015-11-17 03:46:43,459 DEBUG : Working with test: dromaeo_css 03:46:43 INFO - 2015-11-17 03:46:43,459 DEBUG : Generating results file: dromaeo_css 03:46:43 INFO - 2015-11-17 03:46:43,460 DEBUG : Working with test: kraken 03:46:43 INFO - 2015-11-17 03:46:43,460 DEBUG : Generating results file: kraken 03:46:43 INFO - 2015-11-17 03:46:43,460 INFO : javascript benchmark 03:46:43 INFO - 2015-11-17 03:46:43,460 DEBUG : Working with test: v8_7 03:46:43 INFO - 2015-11-17 03:46:43,460 DEBUG : Generating results file: v8_7 03:46:43 INFO - 2015-11-17 03:46:43,460 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 03:46:43 INFO - 2015-11-17 03:46:43,514 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,57]] 03:46:43 INFO - 2015-11-17 03:46:43,514 DEBUG : process_Request line: dromaeo_css 5978.03 graph.html#tests=[[72,64,57]] 03:46:43 INFO - 2015-11-17 03:46:43,514 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 03:46:43 INFO - 2015-11-17 03:46:43,544 DEBUG : process_Request line: kraken 1746.90 graph.html#tests=[[232,64,57]] 03:46:43 INFO - 2015-11-17 03:46:43,544 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 03:46:43 INFO - 2015-11-17 03:46:43,573 DEBUG : process_Request line: v8_7 17431.28 graph.html#tests=[[230,64,57]] 03:46:43 INFO - 2015-11-17 03:46:43,574 INFO : javascript benchmark 03:46:43 INFO - 2015-11-17 03:46:43,576 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [292.7935805257294, 301.06069064518704, 306.61366677985745, 307.3254207015601, 312.403309678514, 10536.525856336464, 10948.507317170726, 15398.0, 15410.306536205884, 15946.92026539867, 10143.391396516214, 10211.591536338537, 10565.630202942899, 10566.0, 10586.729592448917, 3887.455756194135, 3964.8810535683974, 4005.158916627497, 4014.578469260715, 4018.77896715682, 3963.8612648557305, 3987.80060996949, 4012.358022716366, 4015.678745700337, 4073.9185216295655, 3022.8941987030457, 3040.133561934849, 4048.251073551388, 4060.086480541869, 4070.1859628074503, 4203.180379825935, 4337.240982827992, 4369.825206991733, 4377.430933978562, 4377.956220437803, 3617.2042150726797, 3657.7988210648405, 3661.340958627446, 3704.240630670733, 3714.665680088805, 11808.409579520989, 12101.515939362414, 12106.0, 12206.0, 12221.327826969513, 1728.9135543222787, 1735.5400818783032, 1741.878068535203, 1774.104077440897, 1831.8626103042325, 8418.368622353348, 8434.0, 8588.44175128621, 8706.216440520384, 8724.258438032775, 1356.1456282542033, 1391.269583468677, 1392.9094608850392, 1426.8787153092, 1446.2190417174713, 50435.0, 52687.73656131733, 53183.46816531824, 53581.73209133968, 53917.46082539164, 5762.481376676035, 5790.160426738184, 5841.4450627190345, 5858.443447872445, 5924.437178468039, 6699.263081061079, 6704.229013663394, 6774.627395493295, 6775.22084960226, 6780.593164410053, 4810.0, 4879.5120487951635, 4915.115279249698, 4923.064617722621, 4934.629902757308, 5202.869928251748, 5250.343707036621, 5250.868728281824, 5277.683338999673, 5281.867953301198, 2625.4880298342023, 2627.8554679492813, 2645.1799942018038, 2657.4817910507654, 2679.6918354389104, 912.1289168843738, 921.4425272709914, 922.7831459606987, 929.2983797233046, 982.0964712464549, 372.4208855230089, 384.2909831361134, 397.35628282183046, 402.57528307635727, 410.78228538874447, 8908.8663670045, 10399.48002599867, 10675.626353077605, 10711.517981690842, 10792.78414431707, 392.97249192556245, 396.9226000929791, 399.65030598226554, 408.23048553476315, 413.7558840284247, 5511.917321240185, 5706.201131841545, 5746.195532625436, 5787.0, 5892.29292484896, 473253.0, 480978.0, 485989.0, 488766.0, 491393.0, 59784.0, 61745.0, 61795.691021544604, 63156.36843631597, 64194.0, 431.41543208952044, 444.41337434586035, 445.21641910238213, 449.15558749551286, 449.91676539840233, 9601.471919044241, 9640.132388085107, 9914.603415863285, 10044.347117437343, 10152.593896244363, 27603.723962760116, 28716.0, 29012.709872901, 29263.268418289714, 29947.55078673865, 36802.63197368099, 37030.25939481249, 37157.25685486329, 39434.605653943094, 40614.0, 5582.190582365453, 5608.355039170548, 5652.576056795675, 5713.9428605715075, 5720.39935806751, 10558.366498010144, 10635.0, 10749.785004299714, 10756.623518176826, 10841.698996120516, 9136.908630913871, 9263.490508022123, 9300.72097837066, 9359.298052645943, 9363.250939924927, 7805.687772489036, 8818.250448711931, 9026.774330641787, 9072.183503484453, 9349.53252337394, 9240.676576319796, 9306.255499559884, 9479.28905332089, 9512.95243523778, 9521.57152928106, 5477.370102438271, 5576.804811831728, 5641.887162256814, 5641.943580564306, 5645.209670646195, 8839.867401988846, 9065.728028159167, 9229.169374756304, 9244.0, 9439.19766819828], "dojo.html": [2880.4383145286665, 2888.4078763853413, 2942.1614839770664, 2943.7056294370577, 3002.7297543221107, 4732.5977291930185, 4790.784414701338, 4795.0649623323425, 4856.2958371036175, 4880.585150262232, 4646.767661616923, 4732.550407711271, 4777.832775852846, 4815.951840481594, 4865.805367785284, 4425.380446737451, 4461.531539188387, 4495.145922274757, 4501.684882058257, 4522.412086428776, 123.63262318754576, 4475.418195634579, 4504.211762941472, 4552.157850797613, 4574.954250457503, 4491.371208030879, 4494.056248187884, 4539.2737162054245, 4557.316402539613, 4569.702969307001, 4468.151051300275, 4531.342955271467, 4536.86389408315, 4546.136234115507, 4581.175388430114, 4335.544767799367, 4343.04453020335, 4446.355278484634, 4448.621867141297, 4459.777011149429, 4686.601638860667, 4730.432348118214, 4761.976190119027, 4772.164871147535, 4844.951550484485, 5105.438401775802, 5149.0474262261605, 5156.484351564851, 5160.948390516121, 5213.348331458567, 5042.672226305279, 5085.033843569747, 5168.8449346519665, 5183.0, 5226.529612334908, 4686.859394218179, 4812.398450193726, 4852.272159176152, 4852.902941941176, 4922.606191504707, 5174.974125129425, 5178.922316165261, 5269.604779641542, 5275.366955965232, 5324.627276090637, 4949.331840201598, 4982.427020892644, 5014.0, 5033.546980771748, 5081.669691470117, 5187.06632806091, 5193.195054766517, 5210.322658054429, 5261.184516399964, 5288.788448462095, 4925.926111108336, 5050.191969284897, 5122.078025955364, 5126.231065340229, 5142.177251639794, 4920.803167873317, 5094.5669618082875, 5100.0819852426175, 5106.412762532282, 5156.1750119980625, 3979.5622481527007, 4002.939955900664, 4020.2562525932794, 4026.2148880968516, 4067.328890732996, 3497.965020349764, 3503.649635036527, 3535.876244331436, 3640.9453858192146, 3677.2093999790172, 4891.6575839691595, 4898.730569818694, 4916.631252656065, 4925.630577706686, 4949.950500494949, 5186.325777648882, 5190.065788158092, 5192.792288308426, 5197.298364720715, 5218.66078704883, 4814.374131362901, 4849.927251091236, 4872.317875497433, 4905.656604037683, 4958.801647934114, 4537.886552836206, 4564.566366195206, 4595.264757638762, 4606.723596584216, 4619.284010978304, 5282.6302158849285, 5289.788408463695, 5321.5476684482255, 5334.359876814807, 5343.568230166156, 5052.46949070357, 5066.518680725325, 5088.160453525127, 5132.127538318569, 5201.687898726089, 5306.920396193983, 5308.575313974796, 5316.760745766373, 5360.0619891518045, 5367.677939323653, 4903.877403064952, 5168.689878607295, 5170.870728231825, 5197.792088316425, 5216.765245564035, 5110.977804439052, 5158.638895277295, 5183.196604526304, 5188.792448302026, 5199.63602547818, 5071.949280507295, 5088.262201980618, 5097.158968770112, 5102.79588816458, 5136.434992150935, 4929.852104436873, 5008.373953255843, 5046.823361182341, 5053.620978426559, 5113.923291150561, 4838.298446725275, 4886.951130488792, 4895.388076490439, 4953.331300274417, 5015.04714104319, 5045.11710450677, 5055.595552355876, 5099.0, 5115.974420127875, 5117.897642047213, 4800.471948085638, 4882.072406242803, 4912.828051018198, 5012.398512178562, 5043.5460808527405], "mootools.html": [1458.5259790568055, 1553.603831023089, 1585.128179501274, 1594.62526306318, 1621.9432319868806, 6388.712507937143, 6644.700988455519, 6967.198772141205, 7438.962805185974, 7449.962750186248, 7200.459965502582, 7277.0, 7415.962920185391, 7480.401567874571, 7492.325690687837, 2011.0648548425015, 2048.9385318440395, 2070.6479898417306, 2072.3782865140397, 2073.1603700501323, 2014.5668681233533, 2024.3319704497553, 2058.557410156816, 2075.3047729010723, 2097.423208617635, 2010.1155491583656, 2015.3450128708155, 2041.4692180033223, 2046.467918341227, 2064.2362325939425, 2014.7280117184139, 2036.399262217642, 2040.8571400002006, 2063.9690404643943, 2065.39070974063, 1979.0401655197218, 1985.0769392232537, 1987.6124155789628, 2005.5688027074102, 2009.7789243183238, 7297.562146271241, 7312.049433573655, 7317.0, 7424.034875466209, 7434.7397841075845, 4343.261645520269, 4359.149965756678, 4390.253656878338, 4432.512423633398, 4432.711873728197, 2364.5861974154627, 2466.0135945621714, 2641.0, 2705.3236690827293, 2709.417475242832, 773.1147835728116, 804.4047404920375, 806.1656185847678, 810.1250649298743, 818.4475479051616, 8943.821123577558, 9079.31905107113, 9105.59024843877, 9173.678921237724, 9206.26349892007, 3953.6046395360236, 3981.3828856527284, 4039.1921615676392, 4089.427480152781, 4100.384942258685, 8471.618777155043, 8560.443571167854, 8604.913950860537, 8648.654053837901, 8668.523231222218, 4470.530594287618, 4483.843065492757, 4496.505384407713, 4518.909621807546, 4547.15877562652, 4068.186362727407, 4071.1043570414463, 4100.36444351126, 4101.487314085739, 4115.444415003996, 3423.1442139465134, 3507.649235076472, 3520.1551627609188, 3530.3468858261303, 3538.4161613334027, 1110.4336788238056, 1117.3798541809374, 1122.646366394583, 1123.1744667669257, 1133.8299255111635, 945.8817647794026, 961.20700422152, 1180.6044974933493, 1193.9522419103312, 1200.2858299311895, 6894.689738961759, 6931.653417329113, 6944.791656250321, 6961.408280296231, 6986.476014298948, 1075.0485820049312, 1103.4041617526445, 1124.050177599943, 1133.2124173699365, 1138.9316641001567, 5353.491418315254, 5432.02223599748, 5444.50999410055, 5491.752871120809, 5503.697296648723, 8453.689945517583, 8808.647654093893, 8838.513881736437, 8857.557122143868, 8956.328275379372, 8720.563971801384, 8775.956120219485, 8783.209511144029, 8812.8678069829, 8833.779155521035, 6814.897776533356, 6845.794626161123, 6931.272216417305, 6942.305769423118, 6959.338862808025, 6634.170728658918, 6662.56693314933, 6674.466042716474, 6699.598024118569, 6700.631465269262, 7534.472586918863, 7832.725854595062, 7834.451588388758, 7888.921110789048, 7954.482958607672, 7863.882041769492, 8099.716509922125, 8113.716019939274, 8122.065962414398, 8204.425690201628, 6185.690715464299, 6206.255249370104, 6249.218847644044, 6409.4231519163495, 6486.54594178403, 7048.30840598263, 7086.468514861509, 7101.644917754195, 7103.25415831351, 7140.821479463055, 6587.374199451237, 6618.801435956929, 6648.5346025777735, 6703.798886033427, 6729.764458243938, 6118.816435506764, 6467.417932386108, 6502.837429064311, 6597.472202223907, 6614.801555953329, 6557.540972131905, 6588.176477940257, 6635.601863888182, 6640.0, 6671.666416679243, 5689.402612725769, 5849.561282903885, 5916.49709774674, 6016.7292471838, 6052.061930400795, 5908.084246941731, 5953.940460595339, 6017.06735456005, 6096.573239873166, 6157.507399407947], "ext.html": [491.6484713429899, 506.076410550745, 509.80882169186555, 522.9567013807454, 526.2947650148805, 34804.477932830996, 35585.2882942341, 35610.2877942441, 35696.46455303173, 35738.10654733633, 37197.25605487889, 37744.81127594365, 37864.62135378645, 37868.81065594675, 37916.620833791654, 8285.378596605264, 8464.280536154434, 8479.576021198945, 8483.490990540557, 8484.66061357545, 8253.95873020637, 8376.832463350729, 8386.37102217333, 8388.706395276167, 8389.370797190204, 8152.18478152186, 8182.672693092299, 8322.126176751444, 8323.66705331786, 8381.07808141104, 8359.540225287607, 8397.202265784741, 8439.746807595782, 8471.06818249992, 8476.364272679511, 8038.437309388345, 8169.959150204211, 8267.049289331744, 8278.254957053894, 8280.378971577096, 34510.0, 35403.0, 35457.46813797795, 35472.46791298132, 35511.64488355109, 2204.647256438962, 2378.607529757588, 2587.0815860369485, 2645.7486538778785, 2758.7379198976064, 23841.642375364383, 24303.14938977145, 24304.39239019021, 24326.87836560806, 24498.142565010316, 2034.9287774927955, 2083.7082808406835, 2091.8117369436673, 2095.3818623506104, 2219.6004719150546, 209134.0, 209511.0, 209667.0, 210038.99999999846, 210418.0, 43770.34344484835, 45335.093298133856, 50153.24770128451, 50558.0, 50984.49015509798, 47291.0, 47352.05295894063, 47392.52607473881, 47398.763006185436, 47423.525764742604, 14162.221077840817, 14213.78679319811, 14315.28423578817, 14420.855791442162, 14461.204633745034, 11076.778464430827, 11132.49903754333, 11188.0, 11260.605878794202, 11262.831057534144, 16484.423045193602, 16837.242324095445, 16869.746953795704, 16910.661786764194, 16926.492205233862, 7828.138904720477, 8048.919510804817, 8068.878966815502, 8086.757397278091, 8100.149484304181, 820.8112134209165, 837.3134030095264, 877.3288434347729, 903.2728653434049, 936.0826390137703, 23009.194678186184, 23578.17476388318, 23629.527409451715, 24510.264692059267, 24564.87717561401, 922.5986695787354, 938.1181689212119, 961.240619910277, 1022.6114076650974, 1060.671191930504, 12140.392980350947, 12278.324692142018, 12434.440450179764, 12495.187812792321, 12509.124361294804, 285739.0, 289236.0, 289360.0, 289871.0, 293116.0, 44906.775466123116, 45307.0, 45323.0, 45344.546554534034, 45461.0, 1242.105683907585, 1252.298712720861, 1258.9118761686777, 1263.3556885988212, 1278.1883503975043, 23495.41261468477, 25223.49553008966, 25559.361015974748, 25854.482910342063, 25876.223713288633, 41354.37968430416, 41815.1636967265, 41836.0, 41984.790076050645, 42028.78985605053, 225042.0, 232415.0, 232417.0, 232808.0, 233159.0, 26833.0, 39175.80412097921, 40644.79677601593, 40939.7953010233, 41077.0, 40274.1945161101, 41637.0, 41654.37518437165, 41869.0, 42139.7893010533, 33553.0, 33827.492587610715, 34356.48465273073, 34742.65257347394, 35023.824880875436, 34264.31471370609, 34319.82840085884, 34523.82738086394, 34635.65364346425, 34775.0, 34223.31553368968, 34268.48597270993, 34745.131371714895, 35264.11839703925, 35493.82253088718, 30657.693423065484, 31495.21261968469, 31708.524372133976, 31766.523502147025, 31855.0, 22899.0, 23360.299191024296, 23656.763432365457, 23665.881670591538, 23700.644490333005], "prototype.html": [282.38017551474513, 285.85707146426785, 292.8535732133934, 293.53474742533086, 296.2046904062593, 5669.801556945507, 5719.256496655435, 5771.711414429283, 5801.47786699197, 5809.477147056764, 5696.629719068258, 5766.942330576693, 5787.855303617401, 5807.448292412225, 5811.593188476808, 4302.548232435596, 4325.351197320411, 4329.004329004323, 4337.826486940518, 4340.240457919851, 4094.4677191965, 4190.784672444987, 4252.787360631972, 4311.482622085354, 4314.676399270052, 4215.831366745327, 4262.808173632178, 4268.253055715238, 4275.9786201068955, 4302.591253830897, 4237.08902585944, 4238.470191226097, 4251.851185208534, 4270.081932384521, 4289.764062976535, 3634.291313193928, 3639.0, 3647.1246900743895, 3652.579953305351, 3668.2663467306647, 5427.810026649087, 5491.341039075336, 5527.2538207341895, 5554.333479982428, 5570.136628822539, 4827.420709514846, 4840.15297322967, 4842.0, 4842.104210720992, 4848.296996935424, 5916.290045194562, 5946.70266486674, 5951.4048595140575, 5968.7910923117915, 5989.251343582052, 3937.3700207966876, 3946.782926939017, 3953.604639536052, 3963.365861462181, 3987.2424239394713, 6102.0541816018585, 6157.907631385533, 6281.183446152017, 6313.494920406357, 6356.0, 4017.015831121394, 4046.393041043867, 4052.63526282636, 4053.3312003519677, 4062.30940740069, 4123.237201117803, 4140.710150289511, 4144.8134833932545, 4154.833806647761, 4155.127423241153, 4802.351682522884, 4815.109204797123, 4826.1795494765975, 4831.299461578052, 4832.226843704991, 5765.596408251382, 5982.4017598239825, 5992.64044157352, 6007.279126504847, 6015.939840601538, 1428.4643258777958, 1434.5194359889344, 1439.4817865568386, 1440.3230481673597, 1440.985590144085, 920.769807548113, 923.4274749655123, 941.4774799985937, 942.9764255893657, 947.6683160893632, 5776.913346299809, 5818.5636077294375, 5831.0, 5842.5618078644275, 5847.181394604759, 6191.783287584913, 6272.560920735505, 6272.937270627326, 6296.244450665858, 6328.873422531524, 5900.734466948998, 5906.40935906406, 5912.379200184005, 5926.703664816742, 5940.0, 3379.0369744622662, 3420.401429749834, 3420.9486857697157, 3425.3491836550975, 3427.7943323400177, 6308.369163083655, 6518.087467754518, 6542.34576542342, 6554.770583029571, 6567.9671601641685, 6419.550631455753, 6424.38968298011, 6447.80656580294, 6455.386738259952, 6456.418922297016, 6508.0, 6520.641364724891, 6537.901931471032, 6557.147570815763, 6564.868702626016, 6097.420745029215, 6301.8109456716375, 6307.463865571478, 6308.148399965946, 6310.148130002391, 6147.907781383372, 6166.321704612579, 6175.320714721287, 6187.81436556904, 6196.938030619636, 6451.258105317948, 6471.029345598198, 6484.870302594016, 6497.252815926229, 6512.6743662815725, 4000.2199571084525, 4051.1695102504505, 4074.2055299216368, 4082.4488694025927, 4095.52901416329, 6029.849253768691, 6170.074488826712, 6229.5327850410495, 6261.624302541862, 6311.715972781328, 6073.787417440369, 6099.634021958696, 6115.755369785159, 6120.602160859708, 6121.173641558333, 6063.393660633901, 6078.3921607838865, 6103.08453731926, 6104.298005729398, 6105.114758360101, 5750.482456578928, 5931.3178984417345, 5963.493103086286, 5970.253718285215, 5986.4013598639785, 6094.939050609437, 6117.785877494266, 6120.143179954899, 6128.080787881853, 6131.325554188947, 5815.185873977731, 5950.077737950624, 5970.134330522137, 5974.492168165754, 5991.700414979146], "yui.html": [594.666986487567, 656.9474442044634, 677.5832862789384, 693.1508901595549, 731.4623751542618, 10157.847632285513, 10324.225683073762, 10413.68758937232, 10422.270441069128, 10424.739381515456, 9652.131308182263, 9703.61185552577, 9790.0, 9814.656487022956, 9826.410415375065, 624.6033768556965, 641.275358844505, 779.8479296537178, 797.3939805747644, 803.3573141486817, 760.0916904299364, 775.3061010395693, 778.0624347661055, 783.7178615698344, 786.6538722961907, 812.8780682897553, 815.7022686719364, 819.2422009641058, 821.8027673358381, 824.2128767027505, 810.2343285595115, 811.395510344791, 813.0365516862507, 818.4761752478389, 818.811673315135, 600.807741522713, 611.0620197996099, 611.10778263735, 611.4313688269907, 617.8918689229367, 9730.464824434654, 9861.556229969668, 9883.0, 9884.851727224097, 9895.0, 9883.406995580288, 10067.093961543424, 10115.140213081897, 10603.363798172135, 10964.953913021709, 7514.39884809214, 7677.616119194074, 7779.8444031119625, 7813.882791758128, 7878.921210787876, 3000.4749168895573, 3011.578379026938, 3018.320877802477, 3072.523758817387, 3092.056922638594, 43927.341089883674, 44021.99999999968, 44165.77917110394, 45187.0, 45466.772666136785, 8004.5597492138495, 8009.759707208793, 8222.753317400488, 8310.044344900292, 8358.080611132771, 17298.394556190473, 17358.566035849206, 17389.304427822997, 17390.130493475277, 17423.21595528204, 5832.270966129234, 5886.646801191942, 5923.940760592425, 5946.554008449383, 6009.278886533644, 3364.6635336466647, 3380.4253276942486, 3391.7795343302605, 3420.0594836419687, 3428.4171690812623, 2633.4206474575944, 2675.1172113202597, 2677.6652918385203, 2679.9196024119306, 2681.0482278791137, 376.1423953386284, 378.4361301660506, 380.6193806193806, 380.6650147869912, 381.6469765466932, 427.2117942396274, 498.8578255197251, 502.54012094864476, 527.2460381654271, 535.8285348688382, 6851.0, 7029.3673569379, 7118.537295075804, 7235.782926512213, 7724.536527808349, 367.7609553790058, 391.5262532335905, 402.8610129505316, 433.982640694375, 452.31022690397407, 3220.967790322067, 3254.9674503254664, 3608.783472991629, 3623.4927110204594, 3815.8664446744233, 50392.49607503951, 50678.0, 50679.493205067476, 50887.0, 50897.0, 46039.0, 46950.76524617355, 47055.76472117617, 47093.0, 47428.288575671395, 40530.39204411936, 41094.79452602778, 41730.0, 43540.0, 43710.781446092566, 7041.366277035091, 7217.700813853557, 7224.916262560658, 7383.963080184565, 7557.093148822177, 31455.685443145274, 32233.35533289368, 32265.838670806497, 32522.39820814282, 32928.0, 39482.802585988036, 40632.39051414172, 43173.78413107914, 43261.78369108134, 43644.56355436405, 9525.476098814632, 9708.611655533981, 9802.166815820736, 9817.165540929102, 9958.651447199314, 9433.811323773623, 9615.23078153732, 10290.073893349634, 11043.944780276048, 11055.00504954558, 9295.76760580991, 9519.714408567754, 9831.705048848546, 9839.803203936024, 10166.339187952759, 9469.715908522756, 9497.762555936157, 9703.611855525982, 9864.457454840052, 9902.603895844373, 9445.0, 9469.763255918657, 9622.230221582397, 9749.853752193581, 10184.898151018691, 7703.614819259126, 7988.520688758693, 8042.477238979448, 8075.757727268191, 8547.059823419544, 7245.746398876014, 7402.777916662509, 7404.814879628052, 7580.810479738051, 7733.149353570991]}, "summary": {"lowerIsBetter": false, "suite": 5978.033449227854, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 5861.461364810083, "unit": "ms", "value": 5861.461364810083}, "dojo.html": {"lowerIsBetter": false, "filtered": 4749.519115575668, "unit": "ms", "value": 4749.519115575668}, "mootools.html": {"lowerIsBetter": false, "filtered": 4165.001781123938, "unit": "ms", "value": 4165.001781123938}, "ext.html": {"lowerIsBetter": false, "filtered": 16468.817861486616, "unit": "ms", "value": 16468.817861486616}, "prototype.html": {"lowerIsBetter": false, "filtered": 4490.649595959483, "unit": "ms", "value": 4490.649595959483}, "yui.html": {"lowerIsBetter": false, "filtered": 5321.929552884964, "unit": "ms", "value": 5321.929552884964}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0012.e"}, "testrun": {"date": 1447759592, "suite": "dromaeo_css", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151117012303", "branch": "Fx-Team", "revision": "40e3ec35113722d706a62898082dfb0adeb9867c"}}, {"talos_counters": {}, "results": {"audio-dft": [179.0, 184.0, 184.0, 241.0, 213.0, 191.0, 186.0, 185.0, 190.0, 190.0], "ai-astar": [119.0, 101.0, 115.0, 119.0, 114.0, 126.0, 122.0, 121.0, 127.0, 127.0], "imaging-gaussian-blur": [137.0, 136.0, 143.0, 130.0, 143.0, 136.0, 139.0, 136.0, 143.0, 142.0], "audio-beat-detection": [166.0, 147.0, 174.0, 187.0, 150.0, 165.0, 163.0, 151.0, 187.0, 155.0], "json-stringify-tinderbox": [71.0, 79.0, 81.0, 81.0, 81.0, 81.0, 83.0, 81.0, 79.0, 78.0], "stanford-crypto-pbkdf2": [160.0, 176.0, 182.0, 190.0, 174.0, 158.0, 162.0, 182.0, 184.0, 176.0], "json-parse-financial": [68.0, 68.0, 70.0, 72.0, 74.0, 73.0, 74.0, 82.0, 73.0, 74.0], "stanford-crypto-sha256-iterative": [74.0, 80.0, 82.0, 82.0, 85.0, 84.0, 83.0, 82.0, 80.0, 84.0], "audio-fft": [75.0, 81.0, 97.0, 133.0, 79.0, 79.0, 81.0, 84.0, 134.0, 78.0], "imaging-darkroom": [139.0, 149.0, 149.0, 149.0, 144.0, 150.0, 149.0, 149.0, 144.0, 150.0], "stanford-crypto-ccm": [155.0, 157.0, 149.0, 147.0, 147.0, 158.0, 151.0, 158.0, 149.0, 150.0], "audio-oscillator": [97.0, 100.0, 142.0, 102.0, 104.0, 104.0, 142.0, 103.0, 101.0, 139.0], "stanford-crypto-aes": [97.0, 101.0, 101.0, 101.0, 102.0, 102.0, 104.0, 102.0, 100.0, 97.0], "imaging-desaturate": [122.0, 113.0, 112.0, 113.0, 123.0, 114.0, 113.0, 112.0, 123.0, 122.0]}, "summary": {"lowerIsBetter": true, "suite": 1746.8999999999999, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 92.1, "unit": "ms", "value": 92.1}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 174.4, "unit": "ms", "value": 174.4}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 164.5, "unit": "ms", "value": 164.5}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 152.1, "unit": "ms", "value": 152.1}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 147.2, "unit": "ms", "value": 147.2}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 72.8, "unit": "ms", "value": 72.8}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 113.4, "unit": "ms", "value": 113.4}, "ai-astar": {"lowerIsBetter": true, "filtered": 119.1, "unit": "ms", "value": 119.1}, "audio-dft": {"lowerIsBetter": true, "filtered": 194.3, "unit": "ms", "value": 194.3}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 81.6, "unit": "ms", "value": 81.6}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 79.5, "unit": "ms", "value": 79.5}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 138.5, "unit": "ms", "value": 138.5}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 100.7, "unit": "ms", "value": 100.7}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 116.7, "unit": "ms", "value": 116.7}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0012.e"}, "testrun": {"date": 1447759592, "suite": "kraken", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151117012303", "branch": "Fx-Team", "revision": "40e3ec35113722d706a62898082dfb0adeb9867c"}}, {"talos_counters": {}, "results": {"DeltaBlue": [222.17285047767163], "Encrypt": [357.5259206292456], "NavierStokes": [6451.612903225807], "Decrypt": [6555.555555555556], "Splay": [707.7140835102618], "Richards": [182.5150574922431], "RegExp": [31968.75], "Earley": [915.7509157509157], "Boyer": [15134.328358208955], "RayTrace": [1264.2225031605562]}, "summary": {"lowerIsBetter": false, "suite": 17431.280614300307, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 297.59711800000014, "unit": "score", "value": 297.59711800000014}, "Encrypt": {"lowerIsBetter": false, "filtered": 744.5082570000003, "unit": "score", "value": 744.5082570000003}, "NavierStokes": {"lowerIsBetter": false, "filtered": 230.02, "unit": "score", "value": 230.02}, "Decrypt": {"lowerIsBetter": false, "filtered": 40.60388135593217, "unit": "score", "value": 40.60388135593217}, "Splay": {"lowerIsBetter": false, "filtered": 115.14678300000004, "unit": "score", "value": 115.14678300000004}, "RegExp": {"lowerIsBetter": false, "filtered": 28.49610948191591, "unit": "score", "value": 28.49610948191591}, "Richards": {"lowerIsBetter": false, "filtered": 193.41965800000003, "unit": "score", "value": 193.41965800000003}, "Earley": {"lowerIsBetter": false, "filtered": 727.7775960000002, "unit": "score", "value": 727.7775960000002}, "Boyer": {"lowerIsBetter": false, "filtered": 44.03650986193297, "unit": "score", "value": 44.03650986193297}, "RayTrace": {"lowerIsBetter": false, "filtered": 585.3312989999998, "unit": "score", "value": 585.3312989999998}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2.e", "os": "mac", "name": "t-yosemite-r5-0012.e"}, "testrun": {"date": 1447759592, "suite": "v8_7", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151117012303", "branch": "Fx-Team", "revision": "40e3ec35113722d706a62898082dfb0adeb9867c"}}] 03:46:43 INFO - RETURN: dromaeo_css: 5978.03 03:46:43 INFO - RETURN: kraken: 1746.90 03:46:43 INFO - RETURN: v8_7: 17431.28 03:46:43 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,57]]", "result": "17431.28"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,57]]", "result": "1746.90"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,57]]", "result": "5978.03"}}} 03:46:43 INFO - Return code: 0 03:46:43 INFO - # TBPL SUCCESS # 03:46:43 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 03:46:43 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 03:46:43 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 03:46:43 INFO - 2015-11-17 03:46:43.668 screenresolution[2073:26063] starting screenresolution argv=screenresolution get 03:46:43 INFO - 2015-11-17 03:46:43.671 screenresolution[2073:26063] Display 0: 1600x1200x32@60 03:46:43 INFO - 2015-11-17 03:46:43.678 screenresolution[2074:26067] starting screenresolution argv=screenresolution list 03:46:43 INFO - Available Modes on Display 0 03:46:43 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 03:46:43 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 03:46:43 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 03:46:43 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 03:46:43 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 03:46:43 INFO - Intel HD Graphics 3000: 03:46:43 INFO - Chipset Model: Intel HD Graphics 3000 03:46:43 INFO - Type: GPU 03:46:43 INFO - Bus: Built-In 03:46:43 INFO - VRAM (Total): 512 MB 03:46:43 INFO - VRAM (Dynamic, Max): 10 03:46:43 INFO - Vendor: Intel (0x8086) 03:46:43 INFO - Device ID: 0x0116 03:46:43 INFO - Revision ID: 0x0009 03:46:43 INFO - Displays: 03:46:43 INFO - Display: 03:46:43 INFO - Resolution: 1600 x 1200 @ 60 Hz 03:46:43 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 03:46:43 INFO - Display Serial Number: 1600x1200 60 03:46:43 INFO - Main Display: Yes 03:46:43 INFO - Mirror: Off 03:46:43 INFO - Online: Yes 03:46:43 INFO - Rotation: Supported 03:46:43 INFO - Return code: 0 03:46:43 INFO - Running post-action listener: _resource_record_post_action 03:46:43 INFO - Running post-run listener: _resource_record_post_run 03:46:45 INFO - Total resource usage - Wall time: 1251s; CPU: 30.0%; Read bytes: 2703360; Write bytes: 694142976; Read time: 1026; Write time: 55373 03:46:45 INFO - install - Wall time: 40s; CPU: 30.0%; Read bytes: 336843264; Write bytes: 338690048; Read time: 34045; Write time: 9283 03:46:45 INFO - run-tests - Wall time: 1212s; CPU: 30.0%; Read bytes: 2703360; Write bytes: 346146816; Read time: 1026; Write time: 44986 03:46:45 INFO - Running post-run listener: _upload_blobber_files 03:46:45 INFO - Blob upload gear active. 03:46:45 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 03:46:45 INFO - Copying logs to upload dir... 03:46:45 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1301.658906 ========= master_lag: 2.99 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 44 secs) (at 2015-11-17 03:46:48.061054) ========= ========= Started set props: build_url (results: 0, elapsed: 1 secs) (at 2015-11-17 03:46:48.067156) ========= 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.HfYdXLAy2f/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.8g6lBHAQcc/Listeners TMPDIR=/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/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:0x0:0x0 using PTY: False build_url:https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010248 build_url: 'https://queue.taskcluster.net/v1/task/a9PL4EQTR7GTQ_lc2UZtPA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 1.63 ========= ========= Finished set props: build_url (results: 0, elapsed: 1 secs) (at 2015-11-17 03:46:49.705480) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 6 secs) (at 2015-11-17 03:46:49.705880) ========= 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.HfYdXLAy2f/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.8g6lBHAQcc/Listeners TMPDIR=/var/folders/_9/t28c0ng56mb25xlsk8sq_vj400000w/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:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.005366 ========= master_lag: 6.83 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 6 secs) (at 2015-11-17 03:46:56.543138) ========= ========= Started reboot skipped (results: 3, elapsed: 7 secs) (at 2015-11-17 03:46:56.543444) ========= ========= Finished reboot skipped (results: 3, elapsed: 7 secs) (at 2015-11-17 03:47:04.361316) ========= ========= Total master_lag: 11.59 =========