builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-046 starttime: 1463835128.35 results: success (0) buildid: 20160521031436 builduid: b14ff78280814770b970e1cef8a91945 revision: ee9ba5e8d935736380d5c657c67cf2791741b501 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:08.352936) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:08.353397) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:08.353783) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:08.371595) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:08.371916) ========= 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: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-05-21 05:52:08-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 67.2M=0s 2016-05-21 05:52:08 (67.2 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.143171 ========= master_lag: 0.14 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:08.651043) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:08.651316) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018802 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:08.685672) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:08.688963) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev ee9ba5e8d935736380d5c657c67cf2791741b501 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-beta --rev ee9ba5e8d935736380d5c657c67cf2791741b501 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-05-21 05:52:08,715 truncating revision to first 12 chars 2016-05-21 05:52:08,715 Setting DEBUG logging. 2016-05-21 05:52:08,715 attempt 1/10 2016-05-21 05:52:08,716 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/ee9ba5e8d935?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-05-21 05:52:09,140 unpacking tar archive at: mozilla-beta-ee9ba5e8d935/testing/mozharness/ program finished with exit code 0 elapsedTime=0.729801 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:09.432888) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:09.433186) ========= script_repo_revision: ee9ba5e8d935736380d5c657c67cf2791741b501 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:09.433579) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:09.433857) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-21 05:52:09.441478) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-05-21 05:52:09.441769) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 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', 'Mozilla-Beta', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:52:09 INFO - MultiFileLogger online at 20160521 05:52:09 in /builds/slave/test 05:52:09 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 05:52:09 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:52:09 INFO - {'append_to_log': False, 05:52:09 INFO - 'base_work_dir': '/builds/slave/test', 05:52:09 INFO - 'blob_upload_branch': 'Mozilla-Beta', 05:52:09 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:52:09 INFO - 'branch': 'Mozilla-Beta', 05:52:09 INFO - 'buildbot_json_path': 'buildprops.json', 05:52:09 INFO - 'config_files': ('talos/linux_config.py',), 05:52:09 INFO - 'default_actions': ('clobber', 05:52:09 INFO - 'read-buildbot-config', 05:52:09 INFO - 'download-and-extract', 05:52:09 INFO - 'populate-webroot', 05:52:09 INFO - 'create-virtualenv', 05:52:09 INFO - 'install', 05:52:09 INFO - 'run-tests'), 05:52:09 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:52:09 INFO - 'download_minidump_stackwalk': True, 05:52:09 INFO - 'download_symbols': 'ondemand', 05:52:09 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:52:09 INFO - 'tooltool.py': '/tools/tooltool.py', 05:52:09 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:52:09 INFO - '/tools/misc-python/virtualenv.py')}, 05:52:09 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:52:09 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:52:09 INFO - 'installer_path': 'installer.exe', 05:52:09 INFO - 'log_level': 'info', 05:52:09 INFO - 'log_name': 'talos', 05:52:09 INFO - 'log_to_console': True, 05:52:09 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:52:09 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:52:09 INFO - 'opt_config_files': (), 05:52:09 INFO - 'pip_index': False, 05:52:09 INFO - 'sps_profile': False, 05:52:09 INFO - 'sps_profile_interval': 0, 05:52:09 INFO - 'suite': 'dromaeojs-e10s', 05:52:09 INFO - 'system_bits': '32', 05:52:09 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:52:09 INFO - 'title': 'talos-linux64-ix-046', 05:52:09 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:52:09 INFO - 'use_talos_json': True, 05:52:09 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:52:09 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:52:09 INFO - 'work_dir': 'build'} 05:52:09 INFO - ##### 05:52:09 INFO - ##### Running clobber step. 05:52:09 INFO - ##### 05:52:09 INFO - Running pre-action listener: _resource_record_pre_action 05:52:09 INFO - Running main action method: clobber 05:52:09 INFO - rmtree: /builds/slave/test/build 05:52:09 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:52:10 INFO - Running post-action listener: _resource_record_post_action 05:52:10 INFO - ##### 05:52:10 INFO - ##### Running read-buildbot-config step. 05:52:10 INFO - ##### 05:52:10 INFO - Running pre-action listener: _resource_record_pre_action 05:52:10 INFO - Running main action method: read_buildbot_config 05:52:10 INFO - Using buildbot properties: 05:52:10 INFO - { 05:52:10 INFO - "project": "", 05:52:10 INFO - "product": "firefox", 05:52:10 INFO - "script_repo_revision": "production", 05:52:10 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s", 05:52:10 INFO - "repository": "", 05:52:10 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs-e10s", 05:52:10 INFO - "buildid": "20160521031436", 05:52:10 INFO - "pgo_build": "True", 05:52:10 INFO - "basedir": "/builds/slave/test", 05:52:10 INFO - "buildnumber": 108, 05:52:10 INFO - "slavename": "talos-linux64-ix-046", 05:52:10 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 05:52:10 INFO - "platform": "ubuntu64_hw", 05:52:10 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 05:52:10 INFO - "branch": "mozilla-beta", 05:52:10 INFO - "repo_path": "releases/mozilla-beta", 05:52:10 INFO - "revision": "ee9ba5e8d935736380d5c657c67cf2791741b501", 05:52:10 INFO - "stage_platform": "linux64-pgo", 05:52:10 INFO - "builduid": "b14ff78280814770b970e1cef8a91945", 05:52:10 INFO - "slavebuilddir": "test" 05:52:10 INFO - } 05:52:10 INFO - Found installer url https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2. 05:52:10 INFO - Running post-action listener: _resource_record_post_action 05:52:10 INFO - ##### 05:52:10 INFO - ##### Running download-and-extract step. 05:52:10 INFO - ##### 05:52:10 INFO - Running pre-action listener: _resource_record_pre_action 05:52:10 INFO - Running main action method: download_and_extract 05:52:10 INFO - mkdir: /builds/slave/test/build/tests 05:52:10 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')]} 05:52:10 INFO - https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 05:52:10 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 05:52:10 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 05:52:10 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 05:52:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.test_packages.json'}, attempt #1 05:52:17 INFO - Downloaded 1412 bytes. 05:52:17 INFO - Reading from file /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 05:52:17 INFO - Using the following test package requirements: 05:52:17 INFO - {u'common': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 05:52:17 INFO - u'cppunittest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 05:52:17 INFO - u'firefox-47.0.en-US.linux-x86_64.cppunittest.tests.zip'], 05:52:17 INFO - u'gtest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 05:52:17 INFO - u'firefox-47.0.en-US.linux-x86_64.gtest.tests.zip'], 05:52:17 INFO - u'jittest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 05:52:17 INFO - u'jsshell-linux-x86_64.zip'], 05:52:17 INFO - u'mochitest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 05:52:17 INFO - u'firefox-47.0.en-US.linux-x86_64.mochitest.tests.zip'], 05:52:17 INFO - u'mozbase': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 05:52:17 INFO - u'reftest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 05:52:17 INFO - u'firefox-47.0.en-US.linux-x86_64.reftest.tests.zip'], 05:52:17 INFO - u'talos': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 05:52:17 INFO - u'firefox-47.0.en-US.linux-x86_64.talos.tests.zip'], 05:52:17 INFO - u'web-platform': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 05:52:17 INFO - u'firefox-47.0.en-US.linux-x86_64.web-platform.tests.zip'], 05:52:17 INFO - u'webapprt': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 05:52:17 INFO - u'xpcshell': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 05:52:17 INFO - u'firefox-47.0.en-US.linux-x86_64.xpcshell.tests.zip']} 05:52:17 INFO - Downloading packages: [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:52:17 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')]} 05:52:17 INFO - https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:52:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 05:52:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 05:52:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 05:52:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:52:22 INFO - Downloaded 23365488 bytes. 05:52:22 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:52:22 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 05:52:23 INFO - Return code: 0 05:52:23 INFO - Downloading packages: [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 05:52:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:52:23 INFO - https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:52:23 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 05:52:23 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 05:52:23 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 05:52:23 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 05:52:30 INFO - Downloaded 23365488 bytes. 05:52:30 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:52:30 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 05:52:31 INFO - Return code: 0 05:52:31 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')]} 05:52:31 INFO - https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 05:52:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 05:52:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 05:52:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 05:52:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 05:52:32 INFO - Downloaded 10845194 bytes. 05:52:32 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 05:52:32 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 05:52:32 INFO - Return code: 0 05:52: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')]} 05:52:32 INFO - https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 05:52:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 05:52:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 05:52:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 05:52:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.tar.bz2'}, attempt #1 05:52:34 INFO - Downloaded 53800578 bytes. 05:52:34 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 05:52:34 INFO - mkdir: /builds/slave/test/properties 05:52:34 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:52:34 INFO - Writing to file /builds/slave/test/properties/build_url 05:52:34 INFO - Contents: 05:52:34 INFO - build_url:https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 05:52:34 INFO - Running post-action listener: _resource_record_post_action 05:52:34 INFO - Running post-action listener: set_extra_try_arguments 05:52:34 INFO - ##### 05:52:34 INFO - ##### Running populate-webroot step. 05:52:34 INFO - ##### 05:52:34 INFO - Running pre-action listener: _resource_record_pre_action 05:52:34 INFO - Running main action method: populate_webroot 05:52:34 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:52:34 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:52:34 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:52:34 INFO - '--tppagecycles', 05:52:34 INFO - '7'], 05:52:34 INFO - 'tests': ['tsvgm']}}, 05:52:34 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:52:34 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:52:34 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:52:34 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 05:52:34 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:52:34 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:52:34 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:52:34 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:52:34 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:52:34 INFO - 'talos_options': ['--e10s'], 05:52:34 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:52:34 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:52:34 INFO - 'tests': ['damp', 'tps']}, 05:52:34 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:52:34 INFO - 'talos_options': ['--e10s'], 05:52:34 INFO - 'tests': ['damp', 'tps']}, 05:52:34 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:52:34 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:52:34 INFO - 'other': {'tests': ['a11yr', 05:52:34 INFO - 'ts_paint', 05:52:34 INFO - 'tpaint', 05:52:34 INFO - 'sessionrestore', 05:52:34 INFO - 'sessionrestore_no_auto_restore', 05:52:34 INFO - 'tabpaint']}, 05:52:34 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:52:34 INFO - 'tests': ['a11yr', 05:52:34 INFO - 'ts_paint', 05:52:34 INFO - 'tpaint', 05:52:34 INFO - 'sessionrestore', 05:52:34 INFO - 'sessionrestore_no_auto_restore', 05:52:34 INFO - 'tabpaint']}, 05:52:34 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:52:34 INFO - 'tests': ['a11yr', 05:52:34 INFO - 'ts_paint', 05:52:34 INFO - 'tpaint', 05:52:34 INFO - 'sessionrestore', 05:52:34 INFO - 'sessionrestore_no_auto_restore', 05:52:34 INFO - 'tabpaint']}, 05:52:34 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:52:34 INFO - 'tests': ['a11yr', 05:52:34 INFO - 'ts_paint', 05:52:34 INFO - 'tpaint', 05:52:34 INFO - 'sessionrestore', 05:52:34 INFO - 'sessionrestore_no_auto_restore', 05:52:34 INFO - 'tabpaint']}, 05:52:34 INFO - 'other_l64': {'tests': ['a11yr', 05:52:34 INFO - 'ts_paint', 05:52:34 INFO - 'tpaint', 05:52:34 INFO - 'sessionrestore', 05:52:34 INFO - 'sessionrestore_no_auto_restore', 05:52:34 INFO - 'tabpaint']}, 05:52:34 INFO - 'other_nol64': {'tests': ['a11yr', 05:52:34 INFO - 'ts_paint', 05:52:34 INFO - 'tpaint', 05:52:34 INFO - 'sessionrestore', 05:52:34 INFO - 'sessionrestore_no_auto_restore', 05:52:34 INFO - 'tabpaint']}, 05:52:34 INFO - 'svgr': {'tests': ['tsvgx', 05:52:34 INFO - 'tsvgr_opacity', 05:52:34 INFO - 'tart', 05:52:34 INFO - 'tscrollx', 05:52:34 INFO - 'cart']}, 05:52:34 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:52:34 INFO - 'tests': ['tsvgx', 05:52:34 INFO - 'tsvgr_opacity', 05:52:34 INFO - 'tart', 05:52:34 INFO - 'tscrollx', 05:52:34 INFO - 'cart']}, 05:52:34 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:52:34 INFO - 'tests': ['tp5o']}, 05:52:34 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:52:34 INFO - 'talos_options': ['--e10s'], 05:52:34 INFO - 'tests': ['tp5o']}, 05:52:34 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:52:34 INFO - 'talos_options': ['--xperf_path', 05:52:34 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:52:34 INFO - 'tests': ['tp5n']}, 05:52:34 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:52:34 INFO - 'talos_options': ['--e10s', 05:52:34 INFO - '--xperf_path', 05:52:34 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:52:34 INFO - 'tests': ['tp5n']}}, 05:52:34 INFO - 'talos.zip': {'path': '', 05:52:34 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:52:34 INFO - Running post-action listener: _resource_record_post_action 05:52:34 INFO - ##### 05:52:34 INFO - ##### Running create-virtualenv step. 05:52:34 INFO - ##### 05:52:34 INFO - Running pre-action listener: _resource_record_pre_action 05:52:34 INFO - Running main action method: create_virtualenv 05:52:34 INFO - Creating virtualenv /builds/slave/test/build/venv 05:52:34 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 05:52:34 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:52:34 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:52:34 INFO - Using real prefix '/usr' 05:52:34 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:52:35 INFO - Installing distribute.............................................................................................................................................................................................done. 05:52:37 INFO - Installing pip.................done. 05:52:37 INFO - Return code: 0 05:52:37 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:52:37 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')]} 05:52:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:52:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:37 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')]} 05:52:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:52:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe1a501f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x219e410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222d160>, '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 0x222e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x222e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:52:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 05:52:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 05:52:37 INFO - Using env: {'DISPLAY': ':0', 05:52:37 INFO - 'HOME': '/home/cltbld', 05:52:37 INFO - 'LANG': 'en_US.UTF-8', 05:52:37 INFO - 'LANGUAGE': 'en_US:en', 05:52:37 INFO - 'LOGNAME': 'cltbld', 05:52:37 INFO - 'MAIL': '/var/mail/cltbld', 05:52:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:52:37 INFO - 'MOZ_NO_REMOTE': '1', 05:52:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:52:37 INFO - 'NO_EM_RESTART': '1', 05:52:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:52:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:52:37 INFO - 'PWD': '/builds/slave/test', 05:52:37 INFO - 'SHELL': '/bin/bash', 05:52:37 INFO - 'SHLVL': '1', 05:52:37 INFO - 'TERM': 'linux', 05:52:37 INFO - 'TMOUT': '86400', 05:52:37 INFO - 'USER': 'cltbld', 05:52:37 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 05:52:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:52:37 INFO - '_': '/tools/buildbot/bin/python'} 05:52:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:52:37 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 05:52:37 INFO - Cleaning up... 05:52:37 INFO - Return code: 0 05:52:37 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 05:52:37 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')]} 05:52:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:52:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:37 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')]} 05:52:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:52:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe1a501f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x219e410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222d160>, '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 0x222e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x222e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:52:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 05:52:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 05:52:37 INFO - Using env: {'DISPLAY': ':0', 05:52:37 INFO - 'HOME': '/home/cltbld', 05:52:37 INFO - 'LANG': 'en_US.UTF-8', 05:52:37 INFO - 'LANGUAGE': 'en_US:en', 05:52:37 INFO - 'LOGNAME': 'cltbld', 05:52:37 INFO - 'MAIL': '/var/mail/cltbld', 05:52:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:52:37 INFO - 'MOZ_NO_REMOTE': '1', 05:52:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:52:37 INFO - 'NO_EM_RESTART': '1', 05:52:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:52:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:52:37 INFO - 'PWD': '/builds/slave/test', 05:52:37 INFO - 'SHELL': '/bin/bash', 05:52:37 INFO - 'SHLVL': '1', 05:52:37 INFO - 'TERM': 'linux', 05:52:37 INFO - 'TMOUT': '86400', 05:52:37 INFO - 'USER': 'cltbld', 05:52:37 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 05:52:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:52:37 INFO - '_': '/tools/buildbot/bin/python'} 05:52:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:52:37 INFO - Downloading/unpacking psutil>=0.7.1 05:52:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:52:39 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:52:39 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:52:39 INFO - Installing collected packages: psutil 05:52:39 INFO - Running setup.py install for psutil 05:52:39 INFO - building 'psutil._psutil_linux' extension 05:52:39 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 05:52:40 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 05:52:40 INFO - building 'psutil._psutil_posix' extension 05:52:40 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 05:52:40 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 05:52:40 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:52:40 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:52:40 INFO - Successfully installed psutil 05:52:40 INFO - Cleaning up... 05:52:40 INFO - Return code: 0 05:52:40 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 05:52: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')]} 05:52:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:52:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52: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')]} 05:52:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:52:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe1a501f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x219e410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222d160>, '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 0x222e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x222e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:52:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 05:52:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 05:52:40 INFO - Using env: {'DISPLAY': ':0', 05:52:40 INFO - 'HOME': '/home/cltbld', 05:52:40 INFO - 'LANG': 'en_US.UTF-8', 05:52:40 INFO - 'LANGUAGE': 'en_US:en', 05:52:40 INFO - 'LOGNAME': 'cltbld', 05:52:40 INFO - 'MAIL': '/var/mail/cltbld', 05:52:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:52:40 INFO - 'MOZ_NO_REMOTE': '1', 05:52:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:52:40 INFO - 'NO_EM_RESTART': '1', 05:52:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:52:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:52:40 INFO - 'PWD': '/builds/slave/test', 05:52:40 INFO - 'SHELL': '/bin/bash', 05:52:40 INFO - 'SHLVL': '1', 05:52:40 INFO - 'TERM': 'linux', 05:52:40 INFO - 'TMOUT': '86400', 05:52:40 INFO - 'USER': 'cltbld', 05:52:40 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 05:52:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:52:40 INFO - '_': '/tools/buildbot/bin/python'} 05:52:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:52:40 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:52:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:40 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:40 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:42 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:52:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:52:42 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 05:52:42 INFO - Installing collected packages: mozsystemmonitor 05:52:42 INFO - Running setup.py install for mozsystemmonitor 05:52:42 INFO - Successfully installed mozsystemmonitor 05:52:42 INFO - Cleaning up... 05:52:42 INFO - Return code: 0 05:52:42 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:52:42 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')]} 05:52:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:52:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:42 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')]} 05:52:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:52:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe1a501f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x219e410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222d160>, '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 0x222e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x222e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:52:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 05:52:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 05:52:42 INFO - Using env: {'DISPLAY': ':0', 05:52:42 INFO - 'HOME': '/home/cltbld', 05:52:42 INFO - 'LANG': 'en_US.UTF-8', 05:52:42 INFO - 'LANGUAGE': 'en_US:en', 05:52:42 INFO - 'LOGNAME': 'cltbld', 05:52:42 INFO - 'MAIL': '/var/mail/cltbld', 05:52:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:52:42 INFO - 'MOZ_NO_REMOTE': '1', 05:52:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:52:42 INFO - 'NO_EM_RESTART': '1', 05:52:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:52:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:52:42 INFO - 'PWD': '/builds/slave/test', 05:52:42 INFO - 'SHELL': '/bin/bash', 05:52:42 INFO - 'SHLVL': '1', 05:52:42 INFO - 'TERM': 'linux', 05:52:42 INFO - 'TMOUT': '86400', 05:52:42 INFO - 'USER': 'cltbld', 05:52:42 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 05:52:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:52:42 INFO - '_': '/tools/buildbot/bin/python'} 05:52:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:52:42 INFO - Downloading/unpacking blobuploader==1.2.4 05:52:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:44 INFO - Downloading blobuploader-1.2.4.tar.gz 05:52:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:52:44 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:52:44 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 05:52:44 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 05:52:44 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 05:52:44 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 05:52:44 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 05:52:44 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 05:52:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:52:45 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:52:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:45 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:45 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:45 INFO - Downloading docopt-0.6.1.tar.gz 05:52:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:52:45 INFO - Installing collected packages: blobuploader, requests, docopt 05:52:45 INFO - Running setup.py install for blobuploader 05:52:45 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:52:45 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:52:45 INFO - Running setup.py install for requests 05:52:46 INFO - Running setup.py install for docopt 05:52:46 INFO - Successfully installed blobuploader requests docopt 05:52:46 INFO - Cleaning up... 05:52:46 INFO - Return code: 0 05:52:46 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:52: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')]} 05:52:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:52:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52: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')]} 05:52:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:52:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe1a501f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x219e410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222d160>, '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 0x222e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x222e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:52:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:52:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:52:46 INFO - Using env: {'DISPLAY': ':0', 05:52:46 INFO - 'HOME': '/home/cltbld', 05:52:46 INFO - 'LANG': 'en_US.UTF-8', 05:52:46 INFO - 'LANGUAGE': 'en_US:en', 05:52:46 INFO - 'LOGNAME': 'cltbld', 05:52:46 INFO - 'MAIL': '/var/mail/cltbld', 05:52:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:52:46 INFO - 'MOZ_NO_REMOTE': '1', 05:52:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:52:46 INFO - 'NO_EM_RESTART': '1', 05:52:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:52:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:52:46 INFO - 'PWD': '/builds/slave/test', 05:52:46 INFO - 'SHELL': '/bin/bash', 05:52:46 INFO - 'SHLVL': '1', 05:52:46 INFO - 'TERM': 'linux', 05:52:46 INFO - 'TMOUT': '86400', 05:52:46 INFO - 'USER': 'cltbld', 05:52:46 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 05:52:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:52:46 INFO - '_': '/tools/buildbot/bin/python'} 05:52:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:52:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:52:46 INFO - Running setup.py (path:/tmp/pip-AkPMX3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:52:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:52:46 INFO - Running setup.py (path:/tmp/pip-wl1W8T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:52:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:52:46 INFO - Running setup.py (path:/tmp/pip-aj8khn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:52:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:52:46 INFO - Running setup.py (path:/tmp/pip-71MIK1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:52:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:52:46 INFO - Running setup.py (path:/tmp/pip-f7Nei6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:52:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:52:46 INFO - Running setup.py (path:/tmp/pip-O8Ua79-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:52:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:52:46 INFO - Running setup.py (path:/tmp/pip-2bDThC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:52:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:52:46 INFO - Running setup.py (path:/tmp/pip-QaNRzg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:52:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:52:47 INFO - Running setup.py (path:/tmp/pip-ltyyZu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:52:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:52:47 INFO - Running setup.py (path:/tmp/pip-iOl75n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:52:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:52:47 INFO - Running setup.py (path:/tmp/pip-Rv4d6s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:52:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:52:47 INFO - Running setup.py (path:/tmp/pip-PzLn31-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:52:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:52:47 INFO - Running setup.py (path:/tmp/pip-YVQzpE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:52:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:52:47 INFO - Running setup.py (path:/tmp/pip-97hQ1E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:52:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:52:47 INFO - Running setup.py (path:/tmp/pip-VGLDnA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:52:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:52:47 INFO - Running setup.py (path:/tmp/pip-Oht1sY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:52:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:52:47 INFO - Running setup.py (path:/tmp/pip-use5CA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:52:47 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:52:47 INFO - Running setup.py install for manifestparser 05:52:47 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:52:47 INFO - Running setup.py install for mozcrash 05:52:47 INFO - Running setup.py install for mozdebug 05:52:47 INFO - Running setup.py install for mozdevice 05:52:48 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:52:48 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:52:48 INFO - Running setup.py install for mozfile 05:52:48 INFO - Running setup.py install for mozhttpd 05:52:48 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:52:48 INFO - Running setup.py install for mozinfo 05:52:48 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:52:48 INFO - Running setup.py install for mozInstall 05:52:48 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:52:48 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:52:48 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:52:48 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:52:48 INFO - Running setup.py install for mozleak 05:52:48 INFO - Running setup.py install for mozlog 05:52:48 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:52:48 INFO - Running setup.py install for moznetwork 05:52:48 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:52:48 INFO - Running setup.py install for mozprocess 05:52:48 INFO - Running setup.py install for mozprofile 05:52:49 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:52:49 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:52:49 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:52:49 INFO - Running setup.py install for mozrunner 05:52:49 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:52:49 INFO - Running setup.py install for mozscreenshot 05:52:49 INFO - Running setup.py install for moztest 05:52:49 INFO - Running setup.py install for mozversion 05:52:49 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:52:49 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:52:49 INFO - Cleaning up... 05:52:49 INFO - Return code: 0 05:52:49 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:52:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:52:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:52:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:52:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:52:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe1a501f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x219e410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222d160>, '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 0x222e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x222e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:52:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:52:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:52:49 INFO - Using env: {'DISPLAY': ':0', 05:52:49 INFO - 'HOME': '/home/cltbld', 05:52:49 INFO - 'LANG': 'en_US.UTF-8', 05:52:49 INFO - 'LANGUAGE': 'en_US:en', 05:52:49 INFO - 'LOGNAME': 'cltbld', 05:52:49 INFO - 'MAIL': '/var/mail/cltbld', 05:52:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:52:49 INFO - 'MOZ_NO_REMOTE': '1', 05:52:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:52:49 INFO - 'NO_EM_RESTART': '1', 05:52:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:52:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:52:49 INFO - 'PWD': '/builds/slave/test', 05:52:49 INFO - 'SHELL': '/bin/bash', 05:52:49 INFO - 'SHLVL': '1', 05:52:49 INFO - 'TERM': 'linux', 05:52:49 INFO - 'TMOUT': '86400', 05:52:49 INFO - 'USER': 'cltbld', 05:52:49 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 05:52:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:52:49 INFO - '_': '/tools/buildbot/bin/python'} 05:52:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:52:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:52:49 INFO - Running setup.py (path:/tmp/pip-YlqWYO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:52:49 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)) 05:52:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:52:49 INFO - Running setup.py (path:/tmp/pip-avQIkd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:52:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:52:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:52:49 INFO - Running setup.py (path:/tmp/pip-a03UOE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:52:49 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)) 05:52:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:52:49 INFO - Running setup.py (path:/tmp/pip-p0Z6K6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:52:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:52:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:52:49 INFO - Running setup.py (path:/tmp/pip-_oo18n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:52:50 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)) 05:52:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:52:50 INFO - Running setup.py (path:/tmp/pip-LHnK1Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:52:50 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)) 05:52:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:52:50 INFO - Running setup.py (path:/tmp/pip-xgvEWp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:52:50 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)) 05:52:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:52:50 INFO - Running setup.py (path:/tmp/pip-QPYdLa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:52:50 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)) 05:52:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:52:50 INFO - Running setup.py (path:/tmp/pip-IkE2js-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:52:50 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)) 05:52:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:52:50 INFO - Running setup.py (path:/tmp/pip-jxTevR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:52:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:52:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:52:50 INFO - Running setup.py (path:/tmp/pip-JmlyXC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:52:50 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)) 05:52:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:52:50 INFO - Running setup.py (path:/tmp/pip-q956kW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:52:50 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)) 05:52:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:52:50 INFO - Running setup.py (path:/tmp/pip-B14GVS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:52:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 05:52:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:52:50 INFO - Running setup.py (path:/tmp/pip-lckeRx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:52:50 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)) 05:52:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:52:50 INFO - Running setup.py (path:/tmp/pip-0PjDc9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:52:50 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)) 05:52:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:52:50 INFO - Running setup.py (path:/tmp/pip-LD9Jma-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:52:50 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)) 05:52:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:52:50 INFO - Running setup.py (path:/tmp/pip-BY7gvy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:52:50 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)) 05:52:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:52:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:52:50 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)) 05:52:50 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:52:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:52:50 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:52:50 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 05:52:50 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 05:52:50 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 05:52:50 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 05:52:50 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 05:52:50 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 05:52:52 INFO - Downloading blessings-1.6.tar.gz 05:52:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:52:52 INFO - Installing collected packages: blessings 05:52:52 INFO - Running setup.py install for blessings 05:52:52 INFO - Successfully installed blessings 05:52:52 INFO - Cleaning up... 05:52:53 INFO - Return code: 0 05:52:53 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:52:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:52:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:52:53 INFO - Reading from file tmpfile_stdout 05:52:53 INFO - Current package versions: 05:52:53 INFO - argparse == 1.2.1 05:52:53 INFO - blessings == 1.6 05:52:53 INFO - blobuploader == 1.2.4 05:52:53 INFO - docopt == 0.6.1 05:52:53 INFO - manifestparser == 1.1 05:52:53 INFO - mozInstall == 1.12 05:52:53 INFO - mozcrash == 0.17 05:52:53 INFO - mozdebug == 0.1 05:52:53 INFO - mozdevice == 0.48 05:52:53 INFO - mozfile == 1.2 05:52:53 INFO - mozhttpd == 0.7 05:52:53 INFO - mozinfo == 0.9 05:52:53 INFO - mozleak == 0.1 05:52:53 INFO - mozlog == 3.1 05:52:53 INFO - moznetwork == 0.27 05:52:53 INFO - mozprocess == 0.22 05:52:53 INFO - mozprofile == 0.28 05:52:53 INFO - mozrunner == 6.11 05:52:53 INFO - mozscreenshot == 0.1 05:52:53 INFO - mozsystemmonitor == 0.0 05:52:53 INFO - moztest == 0.7 05:52:53 INFO - mozversion == 1.4 05:52:53 INFO - psutil == 3.1.1 05:52:53 INFO - requests == 1.2.3 05:52:53 INFO - wsgiref == 0.1.2 05:52:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:52:53 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')]} 05:52:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:52:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:53 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')]} 05:52:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:52:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe1a501f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x219e410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222d160>, '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 0x222e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x222e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:52:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 05:52:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:52:53 INFO - Using env: {'DISPLAY': ':0', 05:52:53 INFO - 'HOME': '/home/cltbld', 05:52:53 INFO - 'LANG': 'en_US.UTF-8', 05:52:53 INFO - 'LANGUAGE': 'en_US:en', 05:52:53 INFO - 'LOGNAME': 'cltbld', 05:52:53 INFO - 'MAIL': '/var/mail/cltbld', 05:52:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:52:53 INFO - 'MOZ_NO_REMOTE': '1', 05:52:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:52:53 INFO - 'NO_EM_RESTART': '1', 05:52:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:52:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:52:53 INFO - 'PWD': '/builds/slave/test', 05:52:53 INFO - 'SHELL': '/bin/bash', 05:52:53 INFO - 'SHLVL': '1', 05:52:53 INFO - 'TERM': 'linux', 05:52:53 INFO - 'TMOUT': '86400', 05:52:53 INFO - 'USER': 'cltbld', 05:52:53 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 05:52:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:52:53 INFO - '_': '/tools/buildbot/bin/python'} 05:52:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:52:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:52:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 05:52:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 05:52:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:52:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 05:52:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 05:52:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 05:52:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 05:52:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 05:52:53 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:52:53 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:52:53 INFO - Cleaning up... 05:52:53 INFO - Return code: 0 05:52:53 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:52:53 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')]} 05:52:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:52:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:53 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')]} 05:52:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:52:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe1a501f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x219e410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222d160>, '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 0x222e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x222e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:52:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 05:52:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 05:52:53 INFO - Using env: {'DISPLAY': ':0', 05:52:53 INFO - 'HOME': '/home/cltbld', 05:52:53 INFO - 'LANG': 'en_US.UTF-8', 05:52:53 INFO - 'LANGUAGE': 'en_US:en', 05:52:53 INFO - 'LOGNAME': 'cltbld', 05:52:53 INFO - 'MAIL': '/var/mail/cltbld', 05:52:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:52:53 INFO - 'MOZ_NO_REMOTE': '1', 05:52:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:52:53 INFO - 'NO_EM_RESTART': '1', 05:52:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:52:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:52:53 INFO - 'PWD': '/builds/slave/test', 05:52:53 INFO - 'SHELL': '/bin/bash', 05:52:53 INFO - 'SHLVL': '1', 05:52:53 INFO - 'TERM': 'linux', 05:52:53 INFO - 'TMOUT': '86400', 05:52:53 INFO - 'USER': 'cltbld', 05:52:53 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 05:52:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:52:53 INFO - '_': '/tools/buildbot/bin/python'} 05:52:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:52:53 INFO - Downloading/unpacking jsonschema 05:52:53 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 05:52:53 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 05:52:53 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 05:52:53 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 05:52:53 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 05:52:53 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 05:52:55 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:52:55 INFO - Downloading/unpacking functools32 (from jsonschema) 05:52:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:55 INFO - Downloading functools32-3.2.3-2.tar.gz 05:52:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:52:55 INFO - warning: no files found matching '*.txt' 05:52:55 INFO - no previously-included directories found matching 'build' 05:52:55 INFO - no previously-included directories found matching 'dist' 05:52:55 INFO - no previously-included directories found matching '.git*' 05:52:55 INFO - Installing collected packages: jsonschema, functools32 05:52:55 INFO - Running setup.py install for functools32 05:52:55 INFO - warning: no files found matching '*.txt' 05:52:55 INFO - no previously-included directories found matching 'build' 05:52:55 INFO - no previously-included directories found matching 'dist' 05:52:55 INFO - no previously-included directories found matching '.git*' 05:52:55 INFO - Successfully installed jsonschema functools32 05:52:55 INFO - Cleaning up... 05:52:56 INFO - Return code: 0 05:52:56 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 05:52:56 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')]} 05:52:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:52:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:56 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')]} 05:52:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:52:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:52:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe1a501f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20d18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x219e410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222d160>, '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 0x222e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x222e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:52:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 05:52:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 05:52:56 INFO - Using env: {'DISPLAY': ':0', 05:52:56 INFO - 'HOME': '/home/cltbld', 05:52:56 INFO - 'LANG': 'en_US.UTF-8', 05:52:56 INFO - 'LANGUAGE': 'en_US:en', 05:52:56 INFO - 'LOGNAME': 'cltbld', 05:52:56 INFO - 'MAIL': '/var/mail/cltbld', 05:52:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:52:56 INFO - 'MOZ_NO_REMOTE': '1', 05:52:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:52:56 INFO - 'NO_EM_RESTART': '1', 05:52:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:52:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:52:56 INFO - 'PWD': '/builds/slave/test', 05:52:56 INFO - 'SHELL': '/bin/bash', 05:52:56 INFO - 'SHLVL': '1', 05:52:56 INFO - 'TERM': 'linux', 05:52:56 INFO - 'TMOUT': '86400', 05:52:56 INFO - 'USER': 'cltbld', 05:52:56 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 05:52:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:52:56 INFO - '_': '/tools/buildbot/bin/python'} 05:52:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:52:56 INFO - Downloading/unpacking flake8 05:52:56 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 05:52:56 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 05:52:56 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 05:52:56 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 05:52:56 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 05:52:56 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 05:52:58 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 05:52:58 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 05:52:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:58 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 05:52:58 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 05:52:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:58 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 05:52:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:52:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:52:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:52:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 05:52:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:52:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:52:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:52:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:52:58 INFO - no previously-included directories found matching 'docs/_build' 05:52:58 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 05:52:58 INFO - Running setup.py install for pep8 05:52:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:52:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:52:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:52:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:52:58 INFO - no previously-included directories found matching 'docs/_build' 05:52:59 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 05:52:59 INFO - Successfully installed flake8 mccabe pyflakes pep8 05:52:59 INFO - Cleaning up... 05:52:59 INFO - Return code: 0 05:52:59 INFO - Running post-action listener: _resource_record_post_action 05:52:59 INFO - Running post-action listener: _start_resource_monitoring 05:52:59 INFO - Starting resource monitoring. 05:52:59 INFO - ##### 05:52:59 INFO - ##### Running install step. 05:52:59 INFO - ##### 05:52:59 INFO - Running pre-action listener: _resource_record_pre_action 05:52:59 INFO - Running main action method: install 05:52:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:52:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:52:59 INFO - Reading from file tmpfile_stdout 05:52:59 INFO - Detecting whether we're running mozinstall >=1.0... 05:52:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:52:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:52:59 INFO - Reading from file tmpfile_stdout 05:52:59 INFO - Output received: 05:52:59 INFO - Usage: mozinstall [options] installer 05:52:59 INFO - Options: 05:52:59 INFO - -h, --help show this help message and exit 05:52:59 INFO - -d DEST, --destination=DEST 05:52:59 INFO - Directory to install application into. [default: 05:52:59 INFO - "/builds/slave/test"] 05:52:59 INFO - --app=APP Application being installed. [default: firefox] 05:52:59 INFO - mkdir: /builds/slave/test/build/application 05:52:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 05:52:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 05:53:12 INFO - Reading from file tmpfile_stdout 05:53:12 INFO - Output received: 05:53:12 INFO - /builds/slave/test/build/application/firefox/firefox 05:53:12 INFO - Running post-action listener: _resource_record_post_action 05:53:12 INFO - ##### 05:53:12 INFO - ##### Running run-tests step. 05:53:12 INFO - ##### 05:53:12 INFO - Running pre-action listener: _resource_record_pre_action 05:53:12 INFO - Running main action method: run_tests 05:53:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:53:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:53:12 INFO - Python 2.7.3 05:53:12 INFO - Return code: 0 05:53:12 INFO - grabbing minidump binary from tooltool 05:53: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')]} 05:53:12 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/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222d160>, '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 0x222e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x222e4f0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:53:12 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/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 05:53:12 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/linux64/releng.manifest -o -c /builds/tooltool_cache 05:53:12 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:53:12 INFO - Return code: 0 05:53:12 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 05:53:12 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:53:12 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:53:12 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 05:53:12 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:53:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 05:53:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 05:53:13 INFO - Return code: 0 05:53:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-046', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 05:53:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-046 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 05:53:13 INFO - Using env: {'DISPLAY': ':0', 05:53:13 INFO - 'HOME': '/home/cltbld', 05:53:13 INFO - 'LANG': 'en_US.UTF-8', 05:53:13 INFO - 'LANGUAGE': 'en_US:en', 05:53:13 INFO - 'LOGNAME': 'cltbld', 05:53:13 INFO - 'MAIL': '/var/mail/cltbld', 05:53:13 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:53:13 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 05:53:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:53:13 INFO - 'MOZ_NO_REMOTE': '1', 05:53:13 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:53:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:53:13 INFO - 'NO_EM_RESTART': '1', 05:53:13 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:53:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:53:13 INFO - 'PWD': '/builds/slave/test', 05:53:13 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:53:13 INFO - 'SHELL': '/bin/bash', 05:53:13 INFO - 'SHLVL': '1', 05:53:13 INFO - 'TERM': 'linux', 05:53:13 INFO - 'TMOUT': '86400', 05:53:13 INFO - 'USER': 'cltbld', 05:53:13 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954', 05:53:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:53:13 INFO - '_': '/tools/buildbot/bin/python'} 05:53:13 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-046', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 05:53:13 INFO - mozversion application_buildid: 20160521031436 05:53:13 INFO - mozversion application_changeset: ee9ba5e8d935736380d5c657c67cf2791741b501 05:53:13 INFO - mozversion application_display_name: Firefox 05:53:13 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:53:13 INFO - mozversion application_name: Firefox 05:53:13 INFO - mozversion application_remotingname: firefox 05:53:13 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 05:53:13 INFO - mozversion application_vendor: Mozilla 05:53:13 INFO - mozversion application_version: 47.0 05:53:13 INFO - mozversion platform_buildid: 20160521031436 05:53:13 INFO - mozversion platform_changeset: ee9ba5e8d935736380d5c657c67cf2791741b501 05:53:13 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 05:53:13 INFO - mozversion platform_version: 47.0 05:53:13 INFO - using testdate: 1463835193 05:53:13 INFO - actual date: 1463835193 05:53:13 INFO - starting webserver on 'localhost:45550' 05:53:13 INFO - SUITE-START | Running 2 tests 05:53:13 INFO - TEST-START | dromaeo_css 05:53:13 INFO - operating with platform_type : linux_ 05:53:13 INFO - Initialising browser for dromaeo_css test... 05:53:13 INFO - TEST-INFO | started process 12446 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpx1kkpX/profile http://localhost:45550/getInfo.html) 05:53:16 INFO - PROCESS | 12446 | 05:53:16 INFO - PROCESS | 12446 | (process:12525): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 05:53:17 INFO - PROCESS | 12446 | __metrics Screen width/height:1600/1200 05:53:17 INFO - PROCESS | 12446 | colorDepth:24 05:53:17 INFO - PROCESS | 12446 | Browser inner width/height: 1024/697 05:53:17 INFO - PROCESS | 12446 | __metrics 05:53:18 ERROR - PROCESS | 12446 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2859: TypeError: this.tabs is undefined 05:53:19 INFO - TEST-INFO | 12446: exit 0 05:53:19 INFO - Browser initialized. 05:53:19 INFO - Running cycle 1/1 for dromaeo_css test... 05:53:19 INFO - TEST-INFO | started process 12575 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpx1kkpX/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:53:21 INFO - PROCESS | 12575 | 05:53:21 INFO - PROCESS | 12575 | (process:12644): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 05:53:31 INFO - PROCESS | 12575 | RSS: Main: 149700608 05:53:31 INFO - PROCESS | 12575 | 05:54:20 INFO - PROCESS | 12575 | 1463835260725 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] 05:56:29 INFO - PROCESS | 12575 | Cycle 1(1): loaded http://localhost:45550/tests/dromaeo/cssquery-dojo.html (next: http://localhost:45550/tests/dromaeo/cssquery-ext.html) 05:56:30 INFO - PROCESS | 12575 | RSS: Main: 154267648 05:56:30 INFO - PROCESS | 12575 | 05:59:31 INFO - PROCESS | 12575 | Cycle 1(1): loaded http://localhost:45550/tests/dromaeo/cssquery-ext.html (next: http://localhost:45550/tests/dromaeo/cssquery-jquery.html) 05:59:32 INFO - PROCESS | 12575 | RSS: Main: 152469504 05:59:32 INFO - PROCESS | 12575 | 06:02:34 INFO - PROCESS | 12575 | Cycle 1(1): loaded http://localhost:45550/tests/dromaeo/cssquery-jquery.html (next: http://localhost:45550/tests/dromaeo/cssquery-mootools.html) 06:02:34 INFO - PROCESS | 12575 | RSS: Main: 151277568 06:02:34 INFO - PROCESS | 12575 | 06:05:36 INFO - PROCESS | 12575 | Cycle 1(1): loaded http://localhost:45550/tests/dromaeo/cssquery-mootools.html (next: http://localhost:45550/tests/dromaeo/cssquery-prototype.html) 06:05:36 INFO - PROCESS | 12575 | RSS: Main: 152334336 06:05:36 INFO - PROCESS | 12575 | 06:08:39 INFO - PROCESS | 12575 | Cycle 1(1): loaded http://localhost:45550/tests/dromaeo/cssquery-prototype.html (next: http://localhost:45550/tests/dromaeo/cssquery-yui.html) 06:08:39 INFO - PROCESS | 12575 | RSS: Main: 151224320 06:08:39 INFO - PROCESS | 12575 | 06:11:41 INFO - PROCESS | 12575 | Cycle 1(1): loaded http://localhost:45550/tests/dromaeo/cssquery-yui.html (next: http://localhost:45550/tests/dromaeo/cssquery-dojo.html) 06:11:41 INFO - PROCESS | 12575 | RSS: Main: 155230208 06:11:41 INFO - PROCESS | 12575 | 06:11:41 INFO - PROCESS | 12575 | __start_tp_report 06:11:41 INFO - PROCESS | 12575 | _x_x_mozilla_page_load 06:11:41 INFO - PROCESS | 12575 | _x_x_mozilla_page_load_details 06:11:41 INFO - PROCESS | 12575 | |i|pagename|runs| 06:11:41 INFO - PROCESS | 12575 | |0;dojo.html;3377.9662203377966;3417.709494692951;3442.8450719717644;3479.6346383629716;3483.2685136121413;5581.804636837712;5594.188842617823;5602.047651899182;5610.887782244357;5645.971770141154;5598.832035038955;5610.66336019838;5612.719364031792;5614.101743721006;5622.8313150605445;5114.156164232897;5177.30106435632;5218.39988401333;5220.608454365919;5254.290670759456;5057.873553161182;5172.6379153459275;5283.577313814905;5293.206019097128;5294.179402192647;5197.7401129943355;5204.791808327663;5255.343082114736;5263.947360526384;5280.366356037281;5202.141646628321;5234.8691282717855;5240.44975277596;5242.370915490127;5258.13240815265;4967.304577359173;4998.6750861193905;5127.589792816566;5141.948580514184;5205;5470.890582188334;5475.233467314579;5485;5502.944970550283;5540.196671482612;6076.088586711984;6086.7565297388055;6130.233720784902;6138.631682099043;6147.754089836446;5884.6469211847425;6100.69496525172;6131.172291740602;6137.2635283765785;6139.631622102688;5694.60137790359;5705.1727499512335;5708.172315014342;5710.628809127394;5717.171010203539;6225.28409232944;6234.532410069263;6248.843778905563;6275.184226050585;6280.623162610166;5817.243758311392;5951.9702401488585;6028.0355143176885;6039.698015099228;6067.029275315928;6112.786052488142;6127.325994140641;6128.693565321805;6132.877342453126;6145.661988590581;6029.758809647653;6047.637141771508;6072.028475443908;6097.878042439215;6100.054491553817;5851.590388672752;6057.575969682168;6104.17593624855;6134.846628834315;6137.0794380842335;4596.287575425815;4605.976970115195;4611.239145540948;4624.860245967122;4640.234361330343;4058;4147.440095587057;4148.149629325981;4155;4178.247915375201;5679.602427830012;5810.1865738796605;5849.61977471463;5903.0555111182;5955.37468565803;6116.969415152896;6128.4790792783115;6129.897102802424;6137.324894261627;6149.13912052313;5717.113847353667;5824.271966004249;5831;5883.764649414061;5890.2342695449315;5261.605379596545;5277.340332458442;5281.656692314988;5319.281896943863;5331.413544510178;6330.430261276507;6346.936530634634;6347.936520634735;6369.681515924185;6381.936180638134;5950.077737950624;6008.729607167776;6161.661108639068;6167.321594624677;6170.228721409734;6231.781887633911;6242.406971337716;6363.077353783768;6372.904406434;6401.519886008475;6004.099385092271;6024.548158888013;6044.486218671462;6048.213732214784;6074.1799857020505;5910.231669882888;6143.047827586731;6149.815505534841;6156.569040167145;6158.938410615837;5934.881302373842;5960.433758792908;5965.821025369246;5991.161237426851;6045.879082418239;5919.7040147991565;5921.61509501881;5939.287285525765;5952.58331916779;5965.940340596539;5734;5789.131630255495;5847.707614619337;5854.970725146347;5867.383924688017;6008.188894499187;6018.578699490994;6041.18444010053;6051.606645568024;6062.242219722535;5876.030454974882;5895.67573783446;5913.46778789911;5935.881282374415;5936.13925980739 06:11:41 INFO - PROCESS | 12575 | |1;ext.html;505.64604776656347;516.6073783924218;528.0363336910137;540.3812634533458;572.0361191392507;30679.07962761118;39059;39078;39103.21793564127;39349;42129.7893510532;42535.574644253546;42600;42689.35965960513;42761.57238427615;8884.64461421544;9079.092090790935;9084.318676099287;9107;9112.316576256773;8851.690190843321;8968.103189681045;8997.05530919254;8997.640094396216;9012.233960113399;8955.238804701608;8992.955035224815;9010.23413009895;9129.315301352392;9135.223506001998;8899;8949.463032218055;8955.238804701543;8985;9167.587458564381;9066.229370503515;9118;9143.679971201043;9155.542222888895;9212.815743685156;41895.58104418947;42115;42182.367264491055;42377;42378;3813.580506144322;3843.7693738375788;3878.864239751595;3901.453796468497;3988.581198974095;30779.538306925413;30900;31063.534046989313;31364.21589460259;31567;3760.417135344026;3824.4072168813877;3835.8082095895375;3837.6354246346555;3851.634094761021;313619;314736;317339;317935;318165;46284.5371546287;69465.3053469469;69532.3046769536;69658.65170674115;69880.6505967467;42974.35538466925;43223;43356.783216084346;43543.34684979728;43786.56213437889;16260.105694186934;16494.917525412297;16566.917165414096;16617.750733739005;16667.33330666784;12881.613551593467;12951.352432378344;12964.157329773534;12969.157004794659;13099.41052652633;15652.982556133815;15690.450834220748;15707.842921570867;15713.371465141267;15769.132697701507;6018.879622407528;6069.848253793691;6078.483328917003;6203.7828675996125;6223.195273370672;1013.5287091502339;1061.193492945367;1095.3209010413595;1120.0927248928394;1160.7388337623968;29362.706372935998;29397.11808645744;29417;29565.26086847846;30275;1143.5082914346744;1160.4023927677254;1230.0221324047225;1256.8743125687358;1267.8415198100238;15249.390024399121;15369.769453458208;15427.691446171013;15610.14144222056;15860.841391586167;362643;546162;547573;550602;798428;61456.385436145065;62361.06458403128;62615.6869215651;62860.37139628545;62908.37091629025;1443.4947768281017;1450.1878947789062;1460.4085345435117;1464.985350146485;1488.8660020598197;29532.409351812414;30261.697383025887;30608.693913060586;31152;31252.062438126894;49548.75225623849;49914.750426247636;50374.49625503698;50433.49566504288;50555.2416713757;327987;331257;331804;332007;332605;34548.48177277393;34734.47898281578;34875.30249394947;34936.825315873255;35131.473027905115;41140;41161.58838411578;41629.167416652104;51097.23354149616;52047.47952520578;36925.815370922974;37080.62919370772;37254.25491490209;37321.81339093287;39166.80416597899;38466.80766596149;38872.805635971636;39406.60593394144;39542.2091558173;39878.80060599678;38150.80924595359;38435.23129537338;38916;39148.412773807846;39185.608143918194;34287.82856085704;34488.48267276043;35014.299714005065;35117.64882351246;35257.11857203488;26875;26950.730492694824;27158.321041974108;27286.590701139103;27298 06:11:41 INFO - PROCESS | 12575 | |2;jquery.html;351.64659517185225;361.62571738250915;363.73083917900743;375.5737238234603;377.7280358142137;18598.628027439445;18665.906670466644;19089.904550477262;19091.33180338685;19254.133563989602;18663;19293.903530482326;19483.22067117317;19515.21939122437;19532;5489.313835770538;5722.170285308628;5755.597108202427;5756.856078598048;5775.27809023872;5458.072127738294;5618.803341883035;5654.971725141369;5742.138679198112;5743.856403589902;5638.718064096799;5677.43225677431;5684.971575142118;5710;5963.314218864821;5944;5959.40405959405;5980.43185897339;6010.519158467312;6022.638641681513;5657.745401456903;5717.342505611867;5760.8847823043725;5772.105323674838;5772.220750198753;22080;22247.666285005576;22573.77426225733;22964.196253131227;23023.539529209324;2270.2394697776263;2275.476640372707;2397.6643269942224;2428.9392765180837;2521.7730404263702;10144.644937427154;10757.246992710514;10834;10859.728506787314;10904.563817447372;1829.7438358629802;1964.0768838645813;1970.3103913630257;1987.8012198780007;2025.7366542349548;59631.8957369546;59810;62502;63266.367336326504;63334.049989250656;9681.757956051015;10124.088832005154;10141.695749127539;10146.340487868265;10189.694309170736;14064.789028164585;14100;14166.645833854236;14247;14269.357878895475;7691.192424795316;8008.519488830572;8008.719694810654;8020.719274825353;8085.110637829834;7822.6088695564995;7941.682332706742;7986.401019923413;7999.760007199793;8015.118336982927;4525.615322697608;4574.336721175478;4574.81700731967;4606.838760643362;7498.4376171787335;3029.560713696502;3082.2756652186717;3253.8698452062126;3279.8524066417067;3362.411577973845;973.7516933181993;1037.180627304436;1061.984070238947;1094.874089479704;1115.7099154219961;17335.826641733674;17503.562410939827;18104.547386315186;18170.27318907255;18358.990255535806;1014.6905193915926;1018.8267994440963;1029.5109822834243;1081.3998230981724;1087.472575800736;9553;10429.895701042893;10567.524461399256;10597.364158150536;10726.302790318761;451198;452793;461488.0776788351;465589;466622;75553;78225.60887195528;80161.59919200484;80190.59904700439;82782.17217827865;1087.1574529739514;1101.1136035491347;1104;1116.6203490813164;1163.3717792392183;16485.423010195067;16596;16643.3342666292;16764.74852877232;17049.659006819547;36482;36574.817125914204;37784.433233502066;37938.43092353562;38018.61981380151;50537.74731126321;54704.45295546993;54763;54834.72582637061;55249.72375138099;8664.653413863374;8695.695600713176;8881.200691937756;8889.111088891059;8933.597988090421;12805.295708736108;12844.036697247557;12936.353182341034;12991.805122922975;13081.934590326988;10531.94734026325;10684.946575267073;10955.178361622751;11011.229213954946;11045.83431248548;11174.944125279322;11277.436128193722;11577.247478913843;11638.476268568103;11771.058315334923;11159.386233756897;11189.04893084097;11231;11597.420128993348;11707.824382634097;8297.668093276201;8386.077531471412;8552.401331906707;8556;8565.186307300797;8545.102764209918;10535.367877927349;11285.943570282096;11380.829287560528;11742.882571174521 06:11:41 INFO - PROCESS | 12575 | |3;mootools.html;1593.0043722673329;1603.3826976614005;1844.289948369878;1932.1498540642126;1953.3944477212056;7361.447891408153;8002.559859207741;8169.305609023233;8359.03871054829;8376.204260595241;8039.437239393244;8058.717944871931;8127.2279133482225;8129.024517057961;8129.959350203256;2437.622168563871;2464;2464.568700477418;2465.987670061656;2466.4573793765344;2384.29663249341;2433.75662433757;2475.220305603738;2478.330850670318;2493.4265119022634;2425.866577338246;2435.305937807725;2457.5500454731705;2462.9261122166363;2471.0115953618606;2417.226487523993;2420.7337192908767;2421.5520128776234;2428.3200703802963;2457.397937505305;2460.3849037740565;2460.7047154341594;2486.639437281584;2487.6517287579754;2488.688913885764;8203.097659257477;8224.547649879254;8227;8279.254867061933;8283.337333013344;5086.949130508721;5236.031334203185;5249.527542521191;5260.789568417297;5268.683878967274;3210.7912985655857;3224.935501289961;3242.157039169809;3283.8029718216985;3294.5387645729616;1029.9691009269734;1994.6808510638373;2012.2956965062258;2034.08466190215;2035.185925629745;11549.422528873523;11613.76772464546;11634.30194188343;11659.708507287385;11674.241174323726;4359.149965756647;4535;4584.656150788637;4601.470830854495;4619.9769001155455;9298.581563829644;9338.299627527962;9346.20557252641;9359.859602105973;9367.969523352425;5347.037533243975;5376.924615077;5390.0836857734275;5392.649477783932;5393.271908292409;4738.95261047392;4798.520147985174;4860.9548946976565;4876.902461950812;4977.40271167455;3612.7832330060282;3696.5564132304294;3723.069232691827;3784.5836957934607;3805.353089974711;1125.2854437432127;1126.7633796902578;1141.9543218271176;1147.1224513247373;1152.3086148311113;1388.7430825297351;1400.509821562445;1404.8805851502736;1417.815683961099;1426.7788492783636;7929.682812687543;8191.83616327682;8201.548914809742;8230.42387032914;8234.341252699769;1212.4543955220186;1213.3084142038954;1222.8899399054128;1236.0729452910318;1247.7192631657804;6107.755689772448;6156.138140660311;6176.073588961692;6217.875642487125;6238.157848690459;10429.426381548936;10685.893141068645;10823.458827058774;10832.566697332177;10844.891551084389;10186.898131018595;10205.74485637865;10636.41499717523;10641;10680.198985075995;8294.460860044077;8302.169783021649;8381.916180838236;8420.8315833683;8489.915100849035;7552.282533159341;7595.696172153052;7600.239976002355;8055.073666528424;8177.100518942792;9370.39092458988;9459.858102128612;9616.711498655051;9655.420674759536;9766.46284454362;8838.07200243965;9135.177833994972;9313.34806563534;9792.167665748491;9844.704658860246;7609.162992070978;7795.493292935941;7825.256600622932;7857.764267071997;7890.644920978455;7967.163447837894;7996.480228785111;8030.076541197837;8041.597920104088;8062.475939063942;7101;7119.893201601876;7156.177039640508;7199.820004499929;7333.669984850588;7033.577985320897;7080.539764915264;7083.504154709327;7140.6072666003865;7216.819579510554;7448.329650331496;7477.327040566375;7490.775276741707;7510.361619262206;7534;6876.415504682158;6898.068760717239;6900.6204658744255;6903.344182302673;6905.102336696197;6696.631685257163;6851.45188384938;6913.896291555731;6934.4452443805385;6970.756023539152 06:11:41 INFO - PROCESS | 12575 | |4;prototype.html;344.1963016356807;347.16506801143254;349.5316276189908;352.9622908648572;353.1348196917551;6336.683165841707;6395;6400.807975760728;6438.871222575545;6466.094746735461;6328;6336.778212762554;6344.841378965528;6353.0152826312;6354.459870910967;4695.413073365829;4822.083804077231;4859.975700121495;4866.926996095061;4899.828506002291;4829.7585120744;4850.417949846006;4852.539008794159;4866.245731911559;4870.853874383774;4812.951870481285;4813.518648135176;4814.325994360793;4821.90356192876;4836.032793441308;4798.640101992347;4820.228763397857;4842.636802239828;4846.491118432549;4855.927161092586;4214.346776249687;4219;4224;4225.176090662322;4232.576742325774;5894;6051.304100028509;6069.028955367165;6073.149759033695;6075.848103797396;5606.887862242732;5618.606697531174;5624.606277560572;5625.6905870177125;5661.094224923992;6612.471002319803;6640.33596640337;6645.966770166118;6656.633885136315;6657.467402607828;4641.396618439581;4673.719576825401;4674.532546745332;4676.064787042571;4676.368690226844;7005.824854378681;7009.614471204081;7062.223155452947;7069.752558660473;7096.822579435504;4625.930611040837;4743.0988112258565;4749.928751068736;4750.263709125091;4750.928736068961;4867.7322747249245;4878.536539028786;4879.706877677419;4890.388701412324;4897.583705385082;5639.915401268984;5645.040343141676;5657.20799088128;5658.377578466366;5674.943250567524;6806.4554835613035;6812.284710105368;6828.453723702092;6829.863402731918;6835.350641689031;1706.5733566608349;1722.5090849107944;1728.308676529373;1732.3503686117706;1734.2802736864312;1108.6175269531998;1142.0749193153572;1143.6854864912216;1143.9656810295705;1165.44641295384;6512.5766825156215;6541.313162118005;6553.508486863504;6581.670916454158;6615.338466153443;7016.368526832507;7031.6835742390695;7034.472414568825;7039.648017599099;7043.119610048744;6487.318831522716;6590.275069742324;6596.340365963365;6719.832004199837;6723.327667233335;3823.847046118124;3869.1101046759404;3869.4582758413844;3872.3223435898603;3873.6126387361037;7353.757104083306;7370.152432470334;7374.852502950018;7395.963020184865;7405;7230.168530618941;7294.088238970129;7302.707891684273;7309.926900730925;7321.194668586451;7102.254263302382;7362.705491780269;7381.963090184622;7432.479726419098;7445.069366329209;7090.255523170199;7113.608751518716;7154.749583764543;7154.998300238075;7159.176694680178;7004.194517630538;7012.403945664676;7025;7030.261822508563;7031.1211098612675;7389.039424874732;7415.8887616684715;7417.406607471497;7424.96287518559;7432.368248698921;4768.833090841804;4829.589484893823;4855.757212139309;4861.319415281792;4885.291632713308;7075.646217688992;7104.573725576482;7107.60908150036;7114.893276600958;7119.928800711927;6836.906095024772;6875.106236189464;6884.139482564679;6886.414654754402;6899.20659124187;6828.863422731418;6846.281140480178;6851.109355783717;6858.142732158481;6869.793906182823;6512.902306465501;6671.666416679243;6711.899321510084;6733.461323094239;6766.594004359754;6889.345512176335;6909.1018167637885;6914.619695916773;6923.273056329214;6930.410915072275;6753.493487988322;6760.256371799;6763.154605674291;6769.052332673528;6806.829829254309 06:11:41 INFO - PROCESS | 12575 | |5;yui.html;832.7675040939409;921.0283151275402;921.1617428140394;931.3340961212735;936.573858894203;14153.646158846033;15071.773923391143;15142.621434464143;15300.081995080303;15355.078695278291;14462.638434039129;14551.199684017374;14578.416863325481;14617.415303387877;14693.706125877476;912.6577533424983;923.040038360108;952.476138124029;953.31361419778;954.513198268881;960.4525420510312;961.5048250151178;965.5317171171976;965.584798536629;968.4237878462303;1007.279794946613;1007.2948935744971;1007.3200589602026;1008.6822650864991;1010.2927950434688;995.9402435853835;998.0418797953973;998.0767789794411;998.2213873178932;1001.0990108901974;742.1910117971437;744.4602663069286;745.9515131516434;745.9701611935516;746.7461063238525;15690.686186276325;15702.214889255492;15752.1336326502;15785.605359866095;15811.525654230392;14009.369578368998;14044.789328160086;14089.295535223198;14164.220967846764;14299.57101286963;11867.762644747057;11884.524619015228;11898.881011189864;11960.043196544255;12070.577529786504;3821.273957948009;3824.8470061197518;3825;3885.7668539887695;3914.451976723261;54584.454155458334;54760.452395475935;54920.45079549233;55122.44877551213;55168.724156379365;10372.170226381872;10971.506282217319;10991.560337586407;11335.829962550568;11439.084873210124;19626.705599415734;19634.70547941782;19656.70514942277;19709.704354434696;19775.208991640462;7848.7252946147755;7949.364050875916;7977.760667179994;8072.959635201786;8168.060673022678;4215.747055176699;4321.459817522809;4330.978345108254;4358.934615980763;4530.6602004849765;3503.2993401319836;3511.666391692785;3537.4693795930816;3544.5392099026963;3546.219831637036;634.352959980817;634.9047642853609;642.9614223146626;645.0356716708551;650.5316172355896;737.8561180569844;760.1220590218306;776.1462391369448;788.0779487999055;795.1491903663141;9225.769355766159;9259.074092590821;9341.579628916716;9540.093691099335;9778;726.7383741852929;727.3017902813252;751.4176513202312;753.9331845438643;775.968961241544;4052.49343832021;4078.5513593504693;4163.979180104141;4236.391229681706;4266.637335826427;52612;53584;53809.46190538123;53913;54128.72935635375;52983.470165298626;53110.46889531132;54620;54662.45337546653;54731.72634136804;47870;48158.27762583564;48517;49774.75112624414;50168.247476287885;9069.093090690878;9082.137196966278;9129.771755705895;9175.862362064709;9243.907560924574;36485.817570911975;37384.252314953;37493.81253093717;37604.247915041;38255.42616860805;43281.56718432775;43402.56597433985;46415.53584464247;47779.52220477751;47867.76066119647;11893.46479408446;12032.458539365925;12255.448504817483;12336.62990110298;12473.189242699196;13117.540886068942;13208.867911320764;13442.059055865995;13501.797473038108;13755.31223438844;12067.155299128977;12068.275903445821;12211.511539538318;12229.69425764363;12354.073444491878;11436.542538298374;11654.125940554322;11666.533338666359;11720.413979301171;11842.940785296018;11532.135089868125;11683.591074312359;11696.590619328283;11859.05127589808;12309.630711078682;10462.790744184922;10773.138148948223;10884.836727449254;10969.23215374948;11002.394868282321;10413.11488523484;10561.683149505527;10619.946900265759;10699.679009629723;10780.353178809297 06:11:41 INFO - PROCESS | 12575 | __end_tp_report 06:11:41 INFO - PROCESS | 12575 | __start_cc_report 06:11:41 INFO - PROCESS | 12575 | _x_x_mozilla_cycle_collect,331 06:11:41 INFO - PROCESS | 12575 | __end_cc_report 06:11:41 INFO - PROCESS | 12575 | __startTimestamp1463836301864__endTimestamp 06:11:41 INFO - PROCESS | 12575 | 06:11:41 INFO - PROCESS | 12575 | ------- Summary: start ------- 06:11:41 INFO - PROCESS | 12575 | Number of tests: 6 06:11:41 INFO - PROCESS | 12575 | 06:11:41 INFO - PROCESS | 12575 | [#0] dojo.html Cycles:165 Average:5665.86 Median:5895.68 stddev:634.87 (10.8%) stddev-sans-first:610.93 06:11:41 INFO - PROCESS | 12575 | Values: 3378.0 3417.7 3442.8 3479.6 3483.3 5581.8 5594.2 5602.0 5610.9 5646.0 5598.8 5610.7 5612.7 5614.1 5622.8 5114.2 5177.3 5218.4 5220.6 5254.3 5057.9 5172.6 5283.6 5293.2 5294.2 5197.7 5204.8 5255.3 5263.9 5280.4 5202.1 5234.9 5240.4 5242.4 5258.1 4967.3 4998.7 5127.6 5141.9 5205.0 5470.9 5475.2 5485.0 5502.9 5540.2 6076.1 6086.8 6130.2 6138.6 6147.8 5884.6 6100.7 6131.2 6137.3 6139.6 5694.6 5705.2 5708.2 5710.6 5717.2 6225.3 6234.5 6248.8 6275.2 6280.6 5817.2 5952.0 6028.0 6039.7 6067.0 6112.8 6127.3 6128.7 6132.9 6145.7 6029.8 6047.6 6072.0 6097.9 6100.1 5851.6 6057.6 6104.2 6134.8 6137.1 4596.3 4606.0 4611.2 4624.9 4640.2 4058.0 4147.4 4148.1 4155.0 4178.2 5679.6 5810.2 5849.6 5903.1 5955.4 6117.0 6128.5 6129.9 6137.3 6149.1 5717.1 5824.3 5831.0 5883.8 5890.2 5261.6 5277.3 5281.7 5319.3 5331.4 6330.4 6346.9 6347.9 6369.7 6381.9 5950.1 6008.7 6161.7 6167.3 6170.2 6231.8 6242.4 6363.1 6372.9 6401.5 6004.1 6024.5 6044.5 6048.2 6074.2 5910.2 6143.0 6149.8 6156.6 6158.9 5934.9 5960.4 5965.8 5991.2 6045.9 5919.7 5921.6 5939.3 5952.6 5965.9 5734.0 5789.1 5847.7 5855.0 5867.4 6008.2 6018.6 6041.2 6051.6 6062.2 5876.0 5895.7 5913.5 5935.9 5936.1 06:11:41 INFO - PROCESS | 12575 | 06:11:41 INFO - PROCESS | 12575 | [#1] ext.html Cycles:180 Average:56244.00 Median:3865.25 stddev:113528.48 (2937.2%) stddev-sans-first:113769.82 06:11:41 INFO - PROCESS | 12575 | Values: 505.6 516.6 528.0 540.4 572.0 30679.1 39059.0 39078.0 39103.2 39349.0 42129.8 42535.6 42600.0 42689.4 42761.6 8884.6 9079.1 9084.3 9107.0 9112.3 8851.7 8968.1 8997.1 8997.6 9012.2 8955.2 8993.0 9010.2 9129.3 9135.2 8899.0 8949.5 8955.2 8985.0 9167.6 9066.2 9118.0 9143.7 9155.5 9212.8 41895.6 42115.0 42182.4 42377.0 42378.0 3813.6 3843.8 3878.9 3901.5 3988.6 30779.5 30900.0 31063.5 31364.2 31567.0 3760.4 3824.4 3835.8 3837.6 3851.6 313619.0 314736.0 317339.0 317935.0 318165.0 46284.5 69465.3 69532.3 69658.7 69880.7 42974.4 43223.0 43356.8 43543.3 43786.6 16260.1 16494.9 16566.9 16617.8 16667.3 12881.6 12951.4 12964.2 12969.2 13099.4 15653.0 15690.5 15707.8 15713.4 15769.1 6018.9 6069.8 6078.5 6203.8 6223.2 1013.5 1061.2 1095.3 1120.1 1160.7 29362.7 29397.1 29417.0 29565.3 30275.0 1143.5 1160.4 1230.0 1256.9 1267.8 15249.4 15369.8 15427.7 15610.1 15860.8 362643.0 546162.0 547573.0 550602.0 798428.0 61456.4 62361.1 62615.7 62860.4 62908.4 1443.5 1450.2 1460.4 1465.0 1488.9 29532.4 30261.7 30608.7 31152.0 31252.1 49548.8 49914.8 50374.5 50433.5 50555.2 327987.0 331257.0 331804.0 332007.0 332605.0 34548.5 34734.5 34875.3 34936.8 35131.5 41140.0 41161.6 41629.2 51097.2 52047.5 36925.8 37080.6 37254.3 37321.8 39166.8 38466.8 38872.8 39406.6 39542.2 39878.8 38150.8 38435.2 38916.0 39148.4 39185.6 34287.8 34488.5 35014.3 35117.6 35257.1 26875.0 26950.7 27158.3 27286.6 27298.0 06:11:41 INFO - PROCESS | 12575 | 06:11:41 INFO - PROCESS | 12575 | [#2] jquery.html Cycles:180 Average:26898.33 Median:2775.67 stddev:75325.28 (2713.8%) stddev-sans-first:75510.22 06:11:41 INFO - PROCESS | 12575 | Values: 351.6 361.6 363.7 375.6 377.7 18598.6 18665.9 19089.9 19091.3 19254.1 18663.0 19293.9 19483.2 19515.2 19532.0 5489.3 5722.2 5755.6 5756.9 5775.3 5458.1 5618.8 5655.0 5742.1 5743.9 5638.7 5677.4 5685.0 5710.0 5963.3 5944.0 5959.4 5980.4 6010.5 6022.6 5657.7 5717.3 5760.9 5772.1 5772.2 22080.0 22247.7 22573.8 22964.2 23023.5 2270.2 2275.5 2397.7 2428.9 2521.8 10144.6 10757.2 10834.0 10859.7 10904.6 1829.7 1964.1 1970.3 1987.8 2025.7 59631.9 59810.0 62502.0 63266.4 63334.0 9681.8 10124.1 10141.7 10146.3 10189.7 14064.8 14100.0 14166.6 14247.0 14269.4 7691.2 8008.5 8008.7 8020.7 8085.1 7822.6 7941.7 7986.4 7999.8 8015.1 4525.6 4574.3 4574.8 4606.8 7498.4 3029.6 3082.3 3253.9 3279.9 3362.4 973.8 1037.2 1062.0 1094.9 1115.7 17335.8 17503.6 18104.5 18170.3 18359.0 1014.7 1018.8 1029.5 1081.4 1087.5 9553.0 10429.9 10567.5 10597.4 10726.3 451198.0 452793.0 461488.1 465589.0 466622.0 75553.0 78225.6 80161.6 80190.6 82782.2 1087.2 1101.1 1104.0 1116.6 1163.4 16485.4 16596.0 16643.3 16764.7 17049.7 36482.0 36574.8 37784.4 37938.4 38018.6 50537.7 54704.5 54763.0 54834.7 55249.7 8664.7 8695.7 8881.2 8889.1 8933.6 12805.3 12844.0 12936.4 12991.8 13081.9 10531.9 10684.9 10955.2 11011.2 11045.8 11174.9 11277.4 11577.2 11638.5 11771.1 11159.4 11189.0 11231.0 11597.4 11707.8 8297.7 8386.1 8552.4 8556.0 8565.2 8545.1 10535.4 11285.9 11380.8 11742.9 06:11:41 INFO - PROCESS | 12575 | 06:11:41 INFO - PROCESS | 12575 | [#3] mootools.html Cycles:180 Average:5944.75 Median:5361.98 stddev:3053.01 (56.9%) stddev-sans-first:3044.05 06:11:41 INFO - PROCESS | 12575 | Values: 1593.0 1603.4 1844.3 1932.1 1953.4 7361.4 8002.6 8169.3 8359.0 8376.2 8039.4 8058.7 8127.2 8129.0 8130.0 2437.6 2464.0 2464.6 2466.0 2466.5 2384.3 2433.8 2475.2 2478.3 2493.4 2425.9 2435.3 2457.6 2462.9 2471.0 2417.2 2420.7 2421.6 2428.3 2457.4 2460.4 2460.7 2486.6 2487.7 2488.7 8203.1 8224.5 8227.0 8279.3 8283.3 5086.9 5236.0 5249.5 5260.8 5268.7 3210.8 3224.9 3242.2 3283.8 3294.5 1030.0 1994.7 2012.3 2034.1 2035.2 11549.4 11613.8 11634.3 11659.7 11674.2 4359.1 4535.0 4584.7 4601.5 4620.0 9298.6 9338.3 9346.2 9359.9 9368.0 5347.0 5376.9 5390.1 5392.6 5393.3 4739.0 4798.5 4861.0 4876.9 4977.4 3612.8 3696.6 3723.1 3784.6 3805.4 1125.3 1126.8 1142.0 1147.1 1152.3 1388.7 1400.5 1404.9 1417.8 1426.8 7929.7 8191.8 8201.5 8230.4 8234.3 1212.5 1213.3 1222.9 1236.1 1247.7 6107.8 6156.1 6176.1 6217.9 6238.2 10429.4 10685.9 10823.5 10832.6 10844.9 10186.9 10205.7 10636.4 10641.0 10680.2 8294.5 8302.2 8381.9 8420.8 8489.9 7552.3 7595.7 7600.2 8055.1 8177.1 9370.4 9459.9 9616.7 9655.4 9766.5 8838.1 9135.2 9313.3 9792.2 9844.7 7609.2 7795.5 7825.3 7857.8 7890.6 7967.2 7996.5 8030.1 8041.6 8062.5 7101.0 7119.9 7156.2 7199.8 7333.7 7033.6 7080.5 7083.5 7140.6 7216.8 7448.3 7477.3 7490.8 7510.4 7534.0 6876.4 6898.1 6900.6 6903.3 6905.1 6696.6 6851.5 6913.9 6934.4 6970.8 06:11:41 INFO - PROCESS | 12575 | 06:11:41 INFO - PROCESS | 12575 | [#4] prototype.html Cycles:180 Average:5703.62 Median:6499.95 stddev:1742.48 (26.8%) stddev-sans-first:1700.30 06:11:41 INFO - PROCESS | 12575 | Values: 344.2 347.2 349.5 353.0 353.1 6336.7 6395.0 6400.8 6438.9 6466.1 6328.0 6336.8 6344.8 6353.0 6354.5 4695.4 4822.1 4860.0 4866.9 4899.8 4829.8 4850.4 4852.5 4866.2 4870.9 4813.0 4813.5 4814.3 4821.9 4836.0 4798.6 4820.2 4842.6 4846.5 4855.9 4214.3 4219.0 4224.0 4225.2 4232.6 5894.0 6051.3 6069.0 6073.1 6075.8 5606.9 5618.6 5624.6 5625.7 5661.1 6612.5 6640.3 6646.0 6656.6 6657.5 4641.4 4673.7 4674.5 4676.1 4676.4 7005.8 7009.6 7062.2 7069.8 7096.8 4625.9 4743.1 4749.9 4750.3 4750.9 4867.7 4878.5 4879.7 4890.4 4897.6 5639.9 5645.0 5657.2 5658.4 5674.9 6806.5 6812.3 6828.5 6829.9 6835.4 1706.6 1722.5 1728.3 1732.4 1734.3 1108.6 1142.1 1143.7 1144.0 1165.4 6512.6 6541.3 6553.5 6581.7 6615.3 7016.4 7031.7 7034.5 7039.6 7043.1 6487.3 6590.3 6596.3 6719.8 6723.3 3823.8 3869.1 3869.5 3872.3 3873.6 7353.8 7370.2 7374.9 7396.0 7405.0 7230.2 7294.1 7302.7 7309.9 7321.2 7102.3 7362.7 7382.0 7432.5 7445.1 7090.3 7113.6 7154.7 7155.0 7159.2 7004.2 7012.4 7025.0 7030.3 7031.1 7389.0 7415.9 7417.4 7425.0 7432.4 4768.8 4829.6 4855.8 4861.3 4885.3 7075.6 7104.6 7107.6 7114.9 7119.9 6836.9 6875.1 6884.1 6886.4 6899.2 6828.9 6846.3 6851.1 6858.1 6869.8 6512.9 6671.7 6711.9 6733.5 6766.6 6889.3 6909.1 6914.6 6923.3 6930.4 6753.5 6760.3 6763.2 6769.1 6806.8 06:11:41 INFO - PROCESS | 12575 | 06:11:41 INFO - PROCESS | 12575 | [#5] yui.html Cycles:180 Average:14711.72 Median:3983.47 stddev:16489.88 (414.0%) stddev-sans-first:16503.19 06:11:41 INFO - PROCESS | 12575 | Values: 832.8 921.0 921.2 931.3 936.6 14153.6 15071.8 15142.6 15300.1 15355.1 14462.6 14551.2 14578.4 14617.4 14693.7 912.7 923.0 952.5 953.3 954.5 960.5 961.5 965.5 965.6 968.4 1007.3 1007.3 1007.3 1008.7 1010.3 995.9 998.0 998.1 998.2 1001.1 742.2 744.5 746.0 746.0 746.7 15690.7 15702.2 15752.1 15785.6 15811.5 14009.4 14044.8 14089.3 14164.2 14299.6 11867.8 11884.5 11898.9 11960.0 12070.6 3821.3 3824.8 3825.0 3885.8 3914.5 54584.5 54760.5 54920.5 55122.4 55168.7 10372.2 10971.5 10991.6 11335.8 11439.1 19626.7 19634.7 19656.7 19709.7 19775.2 7848.7 7949.4 7977.8 8073.0 8168.1 4215.7 4321.5 4331.0 4358.9 4530.7 3503.3 3511.7 3537.5 3544.5 3546.2 634.4 634.9 643.0 645.0 650.5 737.9 760.1 776.1 788.1 795.1 9225.8 9259.1 9341.6 9540.1 9778.0 726.7 727.3 751.4 753.9 776.0 4052.5 4078.6 4164.0 4236.4 4266.6 52612.0 53584.0 53809.5 53913.0 54128.7 52983.5 53110.5 54620.0 54662.5 54731.7 47870.0 48158.3 48517.0 49774.8 50168.2 9069.1 9082.1 9129.8 9175.9 9243.9 36485.8 37384.3 37493.8 37604.2 38255.4 43281.6 43402.6 46415.5 47779.5 47867.8 11893.5 12032.5 12255.4 12336.6 12473.2 13117.5 13208.9 13442.1 13501.8 13755.3 12067.2 12068.3 12211.5 12229.7 12354.1 11436.5 11654.1 11666.5 11720.4 11842.9 11532.1 11683.6 11696.6 11859.1 12309.6 10462.8 10773.1 10884.8 10969.2 11002.4 10413.1 10561.7 10619.9 10699.7 10780.4 06:11:41 INFO - PROCESS | 12575 | -------- Summary: end -------- 06:11:41 INFO - PROCESS | 12575 | 06:11:42 INFO - TEST-INFO | 12575: exit 0 06:11:42 INFO - TEST-OK | dromaeo_css | took 1109159ms 06:11:42 INFO - TEST-START | kraken 06:11:42 INFO - operating with platform_type : linux_ 06:11:42 INFO - Initialising browser for kraken test... 06:11:42 INFO - TEST-INFO | started process 12819 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpX1VPGU/profile http://localhost:45550/getInfo.html) 06:11:46 INFO - PROCESS | 12819 | 06:11:46 INFO - PROCESS | 12819 | (process:12898): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 06:11:46 INFO - PROCESS | 12819 | __metrics Screen width/height:1600/1200 06:11:46 INFO - PROCESS | 12819 | colorDepth:24 06:11:46 INFO - PROCESS | 12819 | Browser inner width/height: 1024/697 06:11:46 INFO - PROCESS | 12819 | __metrics 06:11:47 ERROR - PROCESS | 12819 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2859: TypeError: this.tabs is undefined 06:11:48 INFO - TEST-INFO | 12819: exit 0 06:11:48 INFO - Browser initialized. 06:11:48 INFO - Running cycle 1/1 for kraken test... 06:11:48 INFO - TEST-INFO | started process 12948 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpX1VPGU/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:11:50 INFO - PROCESS | 12948 | 06:11:50 INFO - PROCESS | 12948 | (process:13016): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 06:12:00 INFO - PROCESS | 12948 | RSS: Main: 149516288 06:12:00 INFO - PROCESS | 12948 | 06:12:02 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:45550/tests/kraken/driver.html?testName=audio-beat-detection) 06:12:03 INFO - PROCESS | 12948 | RSS: Main: 153772032 06:12:03 INFO - PROCESS | 12948 | 06:12:05 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:45550/tests/kraken/driver.html?testName=audio-dft) 06:12:06 INFO - PROCESS | 12948 | RSS: Main: 154263552 06:12:06 INFO - PROCESS | 12948 | 06:12:09 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:45550/tests/kraken/driver.html?testName=audio-fft) 06:12:10 INFO - PROCESS | 12948 | RSS: Main: 154787840 06:12:10 INFO - PROCESS | 12948 | 06:12:12 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:45550/tests/kraken/driver.html?testName=audio-oscillator) 06:12:12 INFO - PROCESS | 12948 | RSS: Main: 155021312 06:12:12 INFO - PROCESS | 12948 | 06:12:14 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:45550/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:12:15 INFO - PROCESS | 12948 | RSS: Main: 154456064 06:12:15 INFO - PROCESS | 12948 | 06:12:18 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:45550/tests/kraken/driver.html?testName=imaging-darkroom) 06:12:19 INFO - PROCESS | 12948 | RSS: Main: 154456064 06:12:19 INFO - PROCESS | 12948 | 06:12:22 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:45550/tests/kraken/driver.html?testName=imaging-desaturate) 06:12:23 INFO - PROCESS | 12948 | RSS: Main: 154992640 06:12:23 INFO - PROCESS | 12948 | 06:12:25 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:45550/tests/kraken/driver.html?testName=json-parse-financial) 06:12:26 INFO - PROCESS | 12948 | RSS: Main: 155160576 06:12:26 INFO - PROCESS | 12948 | 06:12:28 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:45550/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:12:28 INFO - PROCESS | 12948 | RSS: Main: 154730496 06:12:28 INFO - PROCESS | 12948 | 06:12:30 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:45550/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:12:31 INFO - PROCESS | 12948 | RSS: Main: 154771456 06:12:31 INFO - PROCESS | 12948 | 06:12:33 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:45550/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:12:33 INFO - PROCESS | 12948 | RSS: Main: 154906624 06:12:33 INFO - PROCESS | 12948 | 06:12:36 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:45550/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:12:36 INFO - PROCESS | 12948 | RSS: Main: 155054080 06:12:36 INFO - PROCESS | 12948 | 06:12:39 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:45550/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:12:39 INFO - PROCESS | 12948 | RSS: Main: 155545600 06:12:39 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | Cycle 1(1): loaded http://localhost:45550/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:45550/tests/kraken/driver.html?testName=ai-astar) 06:12:41 INFO - PROCESS | 12948 | RSS: Main: 157085696 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | __start_tp_report 06:12:41 INFO - PROCESS | 12948 | _x_x_mozilla_page_load 06:12:41 INFO - PROCESS | 12948 | _x_x_mozilla_page_load_details 06:12:41 INFO - PROCESS | 12948 | |i|pagename|runs| 06:12:41 INFO - PROCESS | 12948 | |0;ai-astar;112;106;111;111;114;123;113;110;111;112 06:12:41 INFO - PROCESS | 12948 | |1;audio-beat-detection;161;127;159;173;127;155;150;137;170;127 06:12:41 INFO - PROCESS | 12948 | |2;audio-dft;161;163;170;162;163;161;161;163;166;163 06:12:41 INFO - PROCESS | 12948 | |3;audio-fft;76;77;76;165;76;76;77;74;160;77 06:12:41 INFO - PROCESS | 12948 | |4;audio-oscillator;93;94;143;93;94;93;145;92;93;140 06:12:41 INFO - PROCESS | 12948 | |5;imaging-gaussian-blur;117;118;117;117;117;117;117;118;117;117 06:12:41 INFO - PROCESS | 12948 | |6;imaging-darkroom;148;151;148;147;147;147;147;147;147;146 06:12:41 INFO - PROCESS | 12948 | |7;imaging-desaturate;96;96;95;96;96;96;95;95;95;96 06:12:41 INFO - PROCESS | 12948 | |8;json-parse-financial;57;55;60;55;57;56;56;59;61;55 06:12:41 INFO - PROCESS | 12948 | |9;json-stringify-tinderbox;80;80;79;79;79;79;79;79;79;80 06:12:41 INFO - PROCESS | 12948 | |10;stanford-crypto-aes;78;79;80;80;81;79;81;78;79;79 06:12:41 INFO - PROCESS | 12948 | |11;stanford-crypto-ccm;118;113;119;128;117;126;115;126;119;114 06:12:41 INFO - PROCESS | 12948 | |12;stanford-crypto-pbkdf2;133;149;147;144;145;136;150;144;147;133 06:12:41 INFO - PROCESS | 12948 | |13;stanford-crypto-sha256-iterative;66;67;71;69;67;67;69;68;69;66 06:12:41 INFO - PROCESS | 12948 | __end_tp_report 06:12:41 INFO - PROCESS | 12948 | __start_cc_report 06:12:41 INFO - PROCESS | 12948 | _x_x_mozilla_cycle_collect,841 06:12:41 INFO - PROCESS | 12948 | __end_cc_report 06:12:41 INFO - PROCESS | 12948 | __startTimestamp1463836361835__endTimestamp 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | ------- Summary: start ------- 06:12:41 INFO - PROCESS | 12948 | Number of tests: 14 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#0] ai-astar Cycles:10 Average:112.30 Median:112.00 stddev:4.32 (3.9%) stddev-sans-first:4.58 06:12:41 INFO - PROCESS | 12948 | Values: 112.0 106.0 111.0 111.0 114.0 123.0 113.0 110.0 111.0 112.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#1] audio-beat-detection Cycles:10 Average:148.60 Median:157.00 stddev:17.93 (11.4%) stddev-sans-first:18.44 06:12:41 INFO - PROCESS | 12948 | Values: 161.0 127.0 159.0 173.0 127.0 155.0 150.0 137.0 170.0 127.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#2] audio-dft Cycles:10 Average:163.30 Median:163.00 stddev:2.79 (1.7%) stddev-sans-first:2.83 06:12:41 INFO - PROCESS | 12948 | Values: 161.0 163.0 170.0 162.0 163.0 161.0 161.0 163.0 166.0 163.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#3] audio-fft Cycles:10 Average:93.40 Median:76.00 stddev:36.45 (48.0%) stddev-sans-first:38.11 06:12:41 INFO - PROCESS | 12948 | Values: 76.0 77.0 76.0 165.0 76.0 76.0 77.0 74.0 160.0 77.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#4] audio-oscillator Cycles:10 Average:108.00 Median:93.00 stddev:23.96 (25.8%) stddev-sans-first:24.79 06:12:41 INFO - PROCESS | 12948 | Values: 93.0 94.0 143.0 93.0 94.0 93.0 145.0 92.0 93.0 140.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#5] imaging-gaussian-blur Cycles:10 Average:117.20 Median:117.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 06:12:41 INFO - PROCESS | 12948 | Values: 117.0 118.0 117.0 117.0 117.0 117.0 117.0 118.0 117.0 117.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#6] imaging-darkroom Cycles:10 Average:147.50 Median:147.00 stddev:1.35 (0.9%) stddev-sans-first:1.42 06:12:41 INFO - PROCESS | 12948 | Values: 148.0 151.0 148.0 147.0 147.0 147.0 147.0 147.0 147.0 146.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.52 (0.5%) stddev-sans-first:0.53 06:12:41 INFO - PROCESS | 12948 | Values: 96.0 96.0 95.0 96.0 96.0 96.0 95.0 95.0 95.0 96.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#8] json-parse-financial Cycles:10 Average:57.10 Median:57.00 stddev:2.18 (3.8%) stddev-sans-first:2.32 06:12:41 INFO - PROCESS | 12948 | Values: 57.0 55.0 60.0 55.0 57.0 56.0 56.0 59.0 61.0 55.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#9] json-stringify-tinderbox Cycles:10 Average:79.30 Median:79.00 stddev:0.48 (0.6%) stddev-sans-first:0.44 06:12:41 INFO - PROCESS | 12948 | Values: 80.0 80.0 79.0 79.0 79.0 79.0 79.0 79.0 79.0 80.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#10] stanford-crypto-aes Cycles:10 Average:79.40 Median:79.50 stddev:1.07 (1.4%) stddev-sans-first:1.01 06:12:41 INFO - PROCESS | 12948 | Values: 78.0 79.0 80.0 80.0 81.0 79.0 81.0 78.0 79.0 79.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#11] stanford-crypto-ccm Cycles:10 Average:119.50 Median:119.00 stddev:5.36 (4.5%) stddev-sans-first:5.66 06:12:41 INFO - PROCESS | 12948 | Values: 118.0 113.0 119.0 128.0 117.0 126.0 115.0 126.0 119.0 114.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:142.80 Median:146.00 stddev:6.43 (4.4%) stddev-sans-first:5.75 06:12:41 INFO - PROCESS | 12948 | Values: 133.0 149.0 147.0 144.0 145.0 136.0 150.0 144.0 147.0 133.0 06:12:41 INFO - PROCESS | 12948 | 06:12:41 INFO - PROCESS | 12948 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.90 Median:68.50 stddev:1.60 (2.3%) stddev-sans-first:1.54 06:12:41 INFO - PROCESS | 12948 | Values: 66.0 67.0 71.0 69.0 67.0 67.0 69.0 68.0 69.0 66.0 06:12:41 INFO - PROCESS | 12948 | -------- Summary: end -------- 06:12:41 INFO - PROCESS | 12948 | 06:12:42 INFO - TEST-INFO | 12948: exit 0 06:12:42 INFO - TEST-OK | kraken | took 60259ms 06:12:42 INFO - SUITE-END | took 1169s 06:12:43 INFO - Completed test suite (00:19:29) 06:12:43 INFO - javascript benchmark 06:12:43 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3377.9662203377966, 3417.709494692951, 3442.8450719717644, 3479.6346383629716, 3483.2685136121413, 5581.804636837712, 5594.188842617823, 5602.047651899182, 5610.887782244357, 5645.971770141154, 5598.832035038955, 5610.66336019838, 5612.719364031792, 5614.101743721006, 5622.8313150605445, 5114.156164232897, 5177.30106435632, 5218.39988401333, 5220.608454365919, 5254.290670759456, 5057.873553161182, 5172.6379153459275, 5283.577313814905, 5293.206019097128, 5294.179402192647, 5197.7401129943355, 5204.791808327663, 5255.343082114736, 5263.947360526384, 5280.366356037281, 5202.141646628321, 5234.8691282717855, 5240.44975277596, 5242.370915490127, 5258.13240815265, 4967.304577359173, 4998.6750861193905, 5127.589792816566, 5141.948580514184, 5205.0, 5470.890582188334, 5475.233467314579, 5485.0, 5502.944970550283, 5540.196671482612, 6076.088586711984, 6086.7565297388055, 6130.233720784902, 6138.631682099043, 6147.754089836446, 5884.6469211847425, 6100.69496525172, 6131.172291740602, 6137.2635283765785, 6139.631622102688, 5694.60137790359, 5705.1727499512335, 5708.172315014342, 5710.628809127394, 5717.171010203539, 6225.28409232944, 6234.532410069263, 6248.843778905563, 6275.184226050585, 6280.623162610166, 5817.243758311392, 5951.9702401488585, 6028.0355143176885, 6039.698015099228, 6067.029275315928, 6112.786052488142, 6127.325994140641, 6128.693565321805, 6132.877342453126, 6145.661988590581, 6029.758809647653, 6047.637141771508, 6072.028475443908, 6097.878042439215, 6100.054491553817, 5851.590388672752, 6057.575969682168, 6104.17593624855, 6134.846628834315, 6137.0794380842335, 4596.287575425815, 4605.976970115195, 4611.239145540948, 4624.860245967122, 4640.234361330343, 4058.0, 4147.440095587057, 4148.149629325981, 4155.0, 4178.247915375201, 5679.602427830012, 5810.1865738796605, 5849.61977471463, 5903.0555111182, 5955.37468565803, 6116.969415152896, 6128.4790792783115, 6129.897102802424, 6137.324894261627, 6149.13912052313, 5717.113847353667, 5824.271966004249, 5831.0, 5883.764649414061, 5890.2342695449315, 5261.605379596545, 5277.340332458442, 5281.656692314988, 5319.281896943863, 5331.413544510178, 6330.430261276507, 6346.936530634634, 6347.936520634735, 6369.681515924185, 6381.936180638134, 5950.077737950624, 6008.729607167776, 6161.661108639068, 6167.321594624677, 6170.228721409734, 6231.781887633911, 6242.406971337716, 6363.077353783768, 6372.904406434, 6401.519886008475, 6004.099385092271, 6024.548158888013, 6044.486218671462, 6048.213732214784, 6074.1799857020505, 5910.231669882888, 6143.047827586731, 6149.815505534841, 6156.569040167145, 6158.938410615837, 5934.881302373842, 5960.433758792908, 5965.821025369246, 5991.161237426851, 6045.879082418239, 5919.7040147991565, 5921.61509501881, 5939.287285525765, 5952.58331916779, 5965.940340596539, 5734.0, 5789.131630255495, 5847.707614619337, 5854.970725146347, 5867.383924688017, 6008.188894499187, 6018.578699490994, 6041.18444010053, 6051.606645568024, 6062.242219722535, 5876.030454974882, 5895.67573783446, 5913.46778789911, 5935.881282374415, 5936.13925980739], "unit": "score", "name": "dojo.html", "value": 5624.414605729201}, {"lowerIsBetter": false, "replicates": [505.64604776656347, 516.6073783924218, 528.0363336910137, 540.3812634533458, 572.0361191392507, 30679.07962761118, 39059.0, 39078.0, 39103.21793564127, 39349.0, 42129.7893510532, 42535.574644253546, 42600.0, 42689.35965960513, 42761.57238427615, 8884.64461421544, 9079.092090790935, 9084.318676099287, 9107.0, 9112.316576256773, 8851.690190843321, 8968.103189681045, 8997.05530919254, 8997.640094396216, 9012.233960113399, 8955.238804701608, 8992.955035224815, 9010.23413009895, 9129.315301352392, 9135.223506001998, 8899.0, 8949.463032218055, 8955.238804701543, 8985.0, 9167.587458564381, 9066.229370503515, 9118.0, 9143.679971201043, 9155.542222888895, 9212.815743685156, 41895.58104418947, 42115.0, 42182.367264491055, 42377.0, 42378.0, 3813.580506144322, 3843.7693738375788, 3878.864239751595, 3901.453796468497, 3988.581198974095, 30779.538306925413, 30900.0, 31063.534046989313, 31364.21589460259, 31567.0, 3760.417135344026, 3824.4072168813877, 3835.8082095895375, 3837.6354246346555, 3851.634094761021, 313619.0, 314736.0, 317339.0, 317935.0, 318165.0, 46284.5371546287, 69465.3053469469, 69532.3046769536, 69658.65170674115, 69880.6505967467, 42974.35538466925, 43223.0, 43356.783216084346, 43543.34684979728, 43786.56213437889, 16260.105694186934, 16494.917525412297, 16566.917165414096, 16617.750733739005, 16667.33330666784, 12881.613551593467, 12951.352432378344, 12964.157329773534, 12969.157004794659, 13099.41052652633, 15652.982556133815, 15690.450834220748, 15707.842921570867, 15713.371465141267, 15769.132697701507, 6018.879622407528, 6069.848253793691, 6078.483328917003, 6203.7828675996125, 6223.195273370672, 1013.5287091502339, 1061.193492945367, 1095.3209010413595, 1120.0927248928394, 1160.7388337623968, 29362.706372935998, 29397.11808645744, 29417.0, 29565.26086847846, 30275.0, 1143.5082914346744, 1160.4023927677254, 1230.0221324047225, 1256.8743125687358, 1267.8415198100238, 15249.390024399121, 15369.769453458208, 15427.691446171013, 15610.14144222056, 15860.841391586167, 362643.0, 546162.0, 547573.0, 550602.0, 798428.0, 61456.385436145065, 62361.06458403128, 62615.6869215651, 62860.37139628545, 62908.37091629025, 1443.4947768281017, 1450.1878947789062, 1460.4085345435117, 1464.985350146485, 1488.8660020598197, 29532.409351812414, 30261.697383025887, 30608.693913060586, 31152.0, 31252.062438126894, 49548.75225623849, 49914.750426247636, 50374.49625503698, 50433.49566504288, 50555.2416713757, 327987.0, 331257.0, 331804.0, 332007.0, 332605.0, 34548.48177277393, 34734.47898281578, 34875.30249394947, 34936.825315873255, 35131.473027905115, 41140.0, 41161.58838411578, 41629.167416652104, 51097.23354149616, 52047.47952520578, 36925.815370922974, 37080.62919370772, 37254.25491490209, 37321.81339093287, 39166.80416597899, 38466.80766596149, 38872.805635971636, 39406.60593394144, 39542.2091558173, 39878.80060599678, 38150.80924595359, 38435.23129537338, 38916.0, 39148.412773807846, 39185.608143918194, 34287.82856085704, 34488.48267276043, 35014.299714005065, 35117.64882351246, 35257.11857203488, 26875.0, 26950.730492694824, 27158.321041974108, 27286.590701139103, 27298.0], "unit": "score", "name": "ext.html", "value": 19441.207178889243}, {"lowerIsBetter": false, "replicates": [351.64659517185225, 361.62571738250915, 363.73083917900743, 375.5737238234603, 377.7280358142137, 18598.628027439445, 18665.906670466644, 19089.904550477262, 19091.33180338685, 19254.133563989602, 18663.0, 19293.903530482326, 19483.22067117317, 19515.21939122437, 19532.0, 5489.313835770538, 5722.170285308628, 5755.597108202427, 5756.856078598048, 5775.27809023872, 5458.072127738294, 5618.803341883035, 5654.971725141369, 5742.138679198112, 5743.856403589902, 5638.718064096799, 5677.43225677431, 5684.971575142118, 5710.0, 5963.314218864821, 5944.0, 5959.40405959405, 5980.43185897339, 6010.519158467312, 6022.638641681513, 5657.745401456903, 5717.342505611867, 5760.8847823043725, 5772.105323674838, 5772.220750198753, 22080.0, 22247.666285005576, 22573.77426225733, 22964.196253131227, 23023.539529209324, 2270.2394697776263, 2275.476640372707, 2397.6643269942224, 2428.9392765180837, 2521.7730404263702, 10144.644937427154, 10757.246992710514, 10834.0, 10859.728506787314, 10904.563817447372, 1829.7438358629802, 1964.0768838645813, 1970.3103913630257, 1987.8012198780007, 2025.7366542349548, 59631.8957369546, 59810.0, 62502.0, 63266.367336326504, 63334.049989250656, 9681.757956051015, 10124.088832005154, 10141.695749127539, 10146.340487868265, 10189.694309170736, 14064.789028164585, 14100.0, 14166.645833854236, 14247.0, 14269.357878895475, 7691.192424795316, 8008.519488830572, 8008.719694810654, 8020.719274825353, 8085.110637829834, 7822.6088695564995, 7941.682332706742, 7986.401019923413, 7999.760007199793, 8015.118336982927, 4525.615322697608, 4574.336721175478, 4574.81700731967, 4606.838760643362, 7498.4376171787335, 3029.560713696502, 3082.2756652186717, 3253.8698452062126, 3279.8524066417067, 3362.411577973845, 973.7516933181993, 1037.180627304436, 1061.984070238947, 1094.874089479704, 1115.7099154219961, 17335.826641733674, 17503.562410939827, 18104.547386315186, 18170.27318907255, 18358.990255535806, 1014.6905193915926, 1018.8267994440963, 1029.5109822834243, 1081.3998230981724, 1087.472575800736, 9553.0, 10429.895701042893, 10567.524461399256, 10597.364158150536, 10726.302790318761, 451198.0, 452793.0, 461488.0776788351, 465589.0, 466622.0, 75553.0, 78225.60887195528, 80161.59919200484, 80190.59904700439, 82782.17217827865, 1087.1574529739514, 1101.1136035491347, 1104.0, 1116.6203490813164, 1163.3717792392183, 16485.423010195067, 16596.0, 16643.3342666292, 16764.74852877232, 17049.659006819547, 36482.0, 36574.817125914204, 37784.433233502066, 37938.43092353562, 38018.61981380151, 50537.74731126321, 54704.45295546993, 54763.0, 54834.72582637061, 55249.72375138099, 8664.653413863374, 8695.695600713176, 8881.200691937756, 8889.111088891059, 8933.597988090421, 12805.295708736108, 12844.036697247557, 12936.353182341034, 12991.805122922975, 13081.934590326988, 10531.94734026325, 10684.946575267073, 10955.178361622751, 11011.229213954946, 11045.83431248548, 11174.944125279322, 11277.436128193722, 11577.247478913843, 11638.476268568103, 11771.058315334923, 11159.386233756897, 11189.04893084097, 11231.0, 11597.420128993348, 11707.824382634097, 8297.668093276201, 8386.077531471412, 8552.401331906707, 8556.0, 8565.186307300797, 8545.102764209918, 10535.367877927349, 11285.943570282096, 11380.829287560528, 11742.882571174521], "unit": "score", "name": "jquery.html", "value": 9119.72840831624}, {"lowerIsBetter": false, "replicates": [1593.0043722673329, 1603.3826976614005, 1844.289948369878, 1932.1498540642126, 1953.3944477212056, 7361.447891408153, 8002.559859207741, 8169.305609023233, 8359.03871054829, 8376.204260595241, 8039.437239393244, 8058.717944871931, 8127.2279133482225, 8129.024517057961, 8129.959350203256, 2437.622168563871, 2464.0, 2464.568700477418, 2465.987670061656, 2466.4573793765344, 2384.29663249341, 2433.75662433757, 2475.220305603738, 2478.330850670318, 2493.4265119022634, 2425.866577338246, 2435.305937807725, 2457.5500454731705, 2462.9261122166363, 2471.0115953618606, 2417.226487523993, 2420.7337192908767, 2421.5520128776234, 2428.3200703802963, 2457.397937505305, 2460.3849037740565, 2460.7047154341594, 2486.639437281584, 2487.6517287579754, 2488.688913885764, 8203.097659257477, 8224.547649879254, 8227.0, 8279.254867061933, 8283.337333013344, 5086.949130508721, 5236.031334203185, 5249.527542521191, 5260.789568417297, 5268.683878967274, 3210.7912985655857, 3224.935501289961, 3242.157039169809, 3283.8029718216985, 3294.5387645729616, 1029.9691009269734, 1994.6808510638373, 2012.2956965062258, 2034.08466190215, 2035.185925629745, 11549.422528873523, 11613.76772464546, 11634.30194188343, 11659.708507287385, 11674.241174323726, 4359.149965756647, 4535.0, 4584.656150788637, 4601.470830854495, 4619.9769001155455, 9298.581563829644, 9338.299627527962, 9346.20557252641, 9359.859602105973, 9367.969523352425, 5347.037533243975, 5376.924615077, 5390.0836857734275, 5392.649477783932, 5393.271908292409, 4738.95261047392, 4798.520147985174, 4860.9548946976565, 4876.902461950812, 4977.40271167455, 3612.7832330060282, 3696.5564132304294, 3723.069232691827, 3784.5836957934607, 3805.353089974711, 1125.2854437432127, 1126.7633796902578, 1141.9543218271176, 1147.1224513247373, 1152.3086148311113, 1388.7430825297351, 1400.509821562445, 1404.8805851502736, 1417.815683961099, 1426.7788492783636, 7929.682812687543, 8191.83616327682, 8201.548914809742, 8230.42387032914, 8234.341252699769, 1212.4543955220186, 1213.3084142038954, 1222.8899399054128, 1236.0729452910318, 1247.7192631657804, 6107.755689772448, 6156.138140660311, 6176.073588961692, 6217.875642487125, 6238.157848690459, 10429.426381548936, 10685.893141068645, 10823.458827058774, 10832.566697332177, 10844.891551084389, 10186.898131018595, 10205.74485637865, 10636.41499717523, 10641.0, 10680.198985075995, 8294.460860044077, 8302.169783021649, 8381.916180838236, 8420.8315833683, 8489.915100849035, 7552.282533159341, 7595.696172153052, 7600.239976002355, 8055.073666528424, 8177.100518942792, 9370.39092458988, 9459.858102128612, 9616.711498655051, 9655.420674759536, 9766.46284454362, 8838.07200243965, 9135.177833994972, 9313.34806563534, 9792.167665748491, 9844.704658860246, 7609.162992070978, 7795.493292935941, 7825.256600622932, 7857.764267071997, 7890.644920978455, 7967.163447837894, 7996.480228785111, 8030.076541197837, 8041.597920104088, 8062.475939063942, 7101.0, 7119.893201601876, 7156.177039640508, 7199.820004499929, 7333.669984850588, 7033.577985320897, 7080.539764915264, 7083.504154709327, 7140.6072666003865, 7216.819579510554, 7448.329650331496, 7477.327040566375, 7490.775276741707, 7510.361619262206, 7534.0, 6876.415504682158, 6898.068760717239, 6900.6204658744255, 6903.344182302673, 6905.102336696197, 6696.631685257163, 6851.45188384938, 6913.896291555731, 6934.4452443805385, 6970.756023539152], "unit": "score", "name": "mootools.html", "value": 4939.438829423341}, {"lowerIsBetter": false, "replicates": [344.1963016356807, 347.16506801143254, 349.5316276189908, 352.9622908648572, 353.1348196917551, 6336.683165841707, 6395.0, 6400.807975760728, 6438.871222575545, 6466.094746735461, 6328.0, 6336.778212762554, 6344.841378965528, 6353.0152826312, 6354.459870910967, 4695.413073365829, 4822.083804077231, 4859.975700121495, 4866.926996095061, 4899.828506002291, 4829.7585120744, 4850.417949846006, 4852.539008794159, 4866.245731911559, 4870.853874383774, 4812.951870481285, 4813.518648135176, 4814.325994360793, 4821.90356192876, 4836.032793441308, 4798.640101992347, 4820.228763397857, 4842.636802239828, 4846.491118432549, 4855.927161092586, 4214.346776249687, 4219.0, 4224.0, 4225.176090662322, 4232.576742325774, 5894.0, 6051.304100028509, 6069.028955367165, 6073.149759033695, 6075.848103797396, 5606.887862242732, 5618.606697531174, 5624.606277560572, 5625.6905870177125, 5661.094224923992, 6612.471002319803, 6640.33596640337, 6645.966770166118, 6656.633885136315, 6657.467402607828, 4641.396618439581, 4673.719576825401, 4674.532546745332, 4676.064787042571, 4676.368690226844, 7005.824854378681, 7009.614471204081, 7062.223155452947, 7069.752558660473, 7096.822579435504, 4625.930611040837, 4743.0988112258565, 4749.928751068736, 4750.263709125091, 4750.928736068961, 4867.7322747249245, 4878.536539028786, 4879.706877677419, 4890.388701412324, 4897.583705385082, 5639.915401268984, 5645.040343141676, 5657.20799088128, 5658.377578466366, 5674.943250567524, 6806.4554835613035, 6812.284710105368, 6828.453723702092, 6829.863402731918, 6835.350641689031, 1706.5733566608349, 1722.5090849107944, 1728.308676529373, 1732.3503686117706, 1734.2802736864312, 1108.6175269531998, 1142.0749193153572, 1143.6854864912216, 1143.9656810295705, 1165.44641295384, 6512.5766825156215, 6541.313162118005, 6553.508486863504, 6581.670916454158, 6615.338466153443, 7016.368526832507, 7031.6835742390695, 7034.472414568825, 7039.648017599099, 7043.119610048744, 6487.318831522716, 6590.275069742324, 6596.340365963365, 6719.832004199837, 6723.327667233335, 3823.847046118124, 3869.1101046759404, 3869.4582758413844, 3872.3223435898603, 3873.6126387361037, 7353.757104083306, 7370.152432470334, 7374.852502950018, 7395.963020184865, 7405.0, 7230.168530618941, 7294.088238970129, 7302.707891684273, 7309.926900730925, 7321.194668586451, 7102.254263302382, 7362.705491780269, 7381.963090184622, 7432.479726419098, 7445.069366329209, 7090.255523170199, 7113.608751518716, 7154.749583764543, 7154.998300238075, 7159.176694680178, 7004.194517630538, 7012.403945664676, 7025.0, 7030.261822508563, 7031.1211098612675, 7389.039424874732, 7415.8887616684715, 7417.406607471497, 7424.96287518559, 7432.368248698921, 4768.833090841804, 4829.589484893823, 4855.757212139309, 4861.319415281792, 4885.291632713308, 7075.646217688992, 7104.573725576482, 7107.60908150036, 7114.893276600958, 7119.928800711927, 6836.906095024772, 6875.106236189464, 6884.139482564679, 6886.414654754402, 6899.20659124187, 6828.863422731418, 6846.281140480178, 6851.109355783717, 6858.142732158481, 6869.793906182823, 6512.902306465501, 6671.666416679243, 6711.899321510084, 6733.461323094239, 6766.594004359754, 6889.345512176335, 6909.1018167637885, 6914.619695916773, 6923.273056329214, 6930.410915072275, 6753.493487988322, 6760.256371799, 6763.154605674291, 6769.052332673528, 6806.829829254309], "unit": "score", "name": "prototype.html", "value": 5133.003955915106}, {"lowerIsBetter": false, "replicates": [832.7675040939409, 921.0283151275402, 921.1617428140394, 931.3340961212735, 936.573858894203, 14153.646158846033, 15071.773923391143, 15142.621434464143, 15300.081995080303, 15355.078695278291, 14462.638434039129, 14551.199684017374, 14578.416863325481, 14617.415303387877, 14693.706125877476, 912.6577533424983, 923.040038360108, 952.476138124029, 953.31361419778, 954.513198268881, 960.4525420510312, 961.5048250151178, 965.5317171171976, 965.584798536629, 968.4237878462303, 1007.279794946613, 1007.2948935744971, 1007.3200589602026, 1008.6822650864991, 1010.2927950434688, 995.9402435853835, 998.0418797953973, 998.0767789794411, 998.2213873178932, 1001.0990108901974, 742.1910117971437, 744.4602663069286, 745.9515131516434, 745.9701611935516, 746.7461063238525, 15690.686186276325, 15702.214889255492, 15752.1336326502, 15785.605359866095, 15811.525654230392, 14009.369578368998, 14044.789328160086, 14089.295535223198, 14164.220967846764, 14299.57101286963, 11867.762644747057, 11884.524619015228, 11898.881011189864, 11960.043196544255, 12070.577529786504, 3821.273957948009, 3824.8470061197518, 3825.0, 3885.7668539887695, 3914.451976723261, 54584.454155458334, 54760.452395475935, 54920.45079549233, 55122.44877551213, 55168.724156379365, 10372.170226381872, 10971.506282217319, 10991.560337586407, 11335.829962550568, 11439.084873210124, 19626.705599415734, 19634.70547941782, 19656.70514942277, 19709.704354434696, 19775.208991640462, 7848.7252946147755, 7949.364050875916, 7977.760667179994, 8072.959635201786, 8168.060673022678, 4215.747055176699, 4321.459817522809, 4330.978345108254, 4358.934615980763, 4530.6602004849765, 3503.2993401319836, 3511.666391692785, 3537.4693795930816, 3544.5392099026963, 3546.219831637036, 634.352959980817, 634.9047642853609, 642.9614223146626, 645.0356716708551, 650.5316172355896, 737.8561180569844, 760.1220590218306, 776.1462391369448, 788.0779487999055, 795.1491903663141, 9225.769355766159, 9259.074092590821, 9341.579628916716, 9540.093691099335, 9778.0, 726.7383741852929, 727.3017902813252, 751.4176513202312, 753.9331845438643, 775.968961241544, 4052.49343832021, 4078.5513593504693, 4163.979180104141, 4236.391229681706, 4266.637335826427, 52612.0, 53584.0, 53809.46190538123, 53913.0, 54128.72935635375, 52983.470165298626, 53110.46889531132, 54620.0, 54662.45337546653, 54731.72634136804, 47870.0, 48158.27762583564, 48517.0, 49774.75112624414, 50168.247476287885, 9069.093090690878, 9082.137196966278, 9129.771755705895, 9175.862362064709, 9243.907560924574, 36485.817570911975, 37384.252314953, 37493.81253093717, 37604.247915041, 38255.42616860805, 43281.56718432775, 43402.56597433985, 46415.53584464247, 47779.52220477751, 47867.76066119647, 11893.46479408446, 12032.458539365925, 12255.448504817483, 12336.62990110298, 12473.189242699196, 13117.540886068942, 13208.867911320764, 13442.059055865995, 13501.797473038108, 13755.31223438844, 12067.155299128977, 12068.275903445821, 12211.511539538318, 12229.69425764363, 12354.073444491878, 11436.542538298374, 11654.125940554322, 11666.533338666359, 11720.413979301171, 11842.940785296018, 11532.135089868125, 11683.591074312359, 11696.590619328283, 11859.05127589808, 12309.630711078682, 10462.790744184922, 10773.138148948223, 10884.836727449254, 10969.23215374948, 11002.394868282321, 10413.11488523484, 10561.683149505527, 10619.946900265759, 10699.679009629723, 10780.353178809297], "unit": "score", "name": "yui.html", "value": 6951.73661633355}], "name": "dromaeo_css", "value": 7484.448986942916}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 106.0, 111.0, 111.0, 114.0, 123.0, 113.0, 110.0, 111.0, 112.0], "unit": "score", "name": "ai-astar", "value": 112.3}, {"lowerIsBetter": true, "replicates": [161.0, 127.0, 159.0, 173.0, 127.0, 155.0, 150.0, 137.0, 170.0, 127.0], "unit": "score", "name": "audio-beat-detection", "value": 148.6}, {"lowerIsBetter": true, "replicates": [161.0, 163.0, 170.0, 162.0, 163.0, 161.0, 161.0, 163.0, 166.0, 163.0], "unit": "score", "name": "audio-dft", "value": 163.3}, {"lowerIsBetter": true, "replicates": [76.0, 77.0, 76.0, 165.0, 76.0, 76.0, 77.0, 74.0, 160.0, 77.0], "unit": "score", "name": "audio-fft", "value": 93.4}, {"lowerIsBetter": true, "replicates": [93.0, 94.0, 143.0, 93.0, 94.0, 93.0, 145.0, 92.0, 93.0, 140.0], "unit": "score", "name": "audio-oscillator", "value": 108.0}, {"lowerIsBetter": true, "replicates": [117.0, 118.0, 117.0, 117.0, 117.0, 117.0, 117.0, 118.0, 117.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.2}, {"lowerIsBetter": true, "replicates": [148.0, 151.0, 148.0, 147.0, 147.0, 147.0, 147.0, 147.0, 147.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 147.5}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 95.0, 96.0, 96.0, 96.0, 95.0, 95.0, 95.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.6}, {"lowerIsBetter": true, "replicates": [57.0, 55.0, 60.0, 55.0, 57.0, 56.0, 56.0, 59.0, 61.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 57.1}, {"lowerIsBetter": true, "replicates": [80.0, 80.0, 79.0, 79.0, 79.0, 79.0, 79.0, 79.0, 79.0, 80.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 79.3}, {"lowerIsBetter": true, "replicates": [78.0, 79.0, 80.0, 80.0, 81.0, 79.0, 81.0, 78.0, 79.0, 79.0], "unit": "score", "name": "stanford-crypto-aes", "value": 79.4}, {"lowerIsBetter": true, "replicates": [118.0, 113.0, 119.0, 128.0, 117.0, 126.0, 115.0, 126.0, 119.0, 114.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 119.5}, {"lowerIsBetter": true, "replicates": [133.0, 149.0, 147.0, 144.0, 145.0, 136.0, 150.0, 144.0, 147.0, 133.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 142.8}, {"lowerIsBetter": true, "replicates": [66.0, 67.0, 71.0, 69.0, 67.0, 67.0, 69.0, 68.0, 69.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 67.9}], "name": "kraken", "value": 1531.9}]} 06:12:43 INFO - Return code: 0 06:12:43 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 06:12:43 ERROR - # TBPL SUCCESS # 06:12:43 INFO - Running post-action listener: _resource_record_post_action 06:12:43 INFO - Running post-run listener: _resource_record_post_run 06:12:44 INFO - Total resource usage - Wall time: 1183s; CPU: 13.0%; Read bytes: 36864; Write bytes: 460390400; Read time: 84; Write time: 376112 06:12:44 INFO - install - Wall time: 13s; CPU: 14.0%; Read bytes: 0; Write bytes: 237350912; Read time: 0; Write time: 242076 06:12:44 INFO - run-tests - Wall time: 1171s; CPU: 13.0%; Read bytes: 36864; Write bytes: 223039488; Read time: 84; Write time: 134036 06:12:44 INFO - Running post-run listener: _upload_blobber_files 06:12:44 INFO - Blob upload gear active. 06:12:44 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:12:44 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 06:12:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 06:12:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 06:12:44 INFO - (blobuploader) - INFO - Open directory for files ... 06:12:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 06:12:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:12:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:12:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 06:12:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:12:45 INFO - (blobuploader) - INFO - Done attempting. 06:12:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 06:12:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:12:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:12:46 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 06:12:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:12:46 INFO - (blobuploader) - INFO - Done attempting. 06:12:46 INFO - (blobuploader) - INFO - Iteration through files over. 06:12:46 INFO - Return code: 0 06:12:46 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:12:46 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:12:46 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/4a81abf616a84979ed748c64bf3dcdb852540eeda01836961115bc38a2c46281e7ce394ac9d4bd696f258222a61591387b3e5fd2a106b17ffb9cc41048475607", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/4332b3003751c4ea6360e140a715c13a2e9792c3644a1f080a9d49a7de811f2ef803776a22fffdc1427a27c11bab289e4a96102d45721fc9c95cb0f3bd196c9c"} 06:12:46 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:12:46 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:12:46 INFO - Contents: 06:12:46 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/4a81abf616a84979ed748c64bf3dcdb852540eeda01836961115bc38a2c46281e7ce394ac9d4bd696f258222a61591387b3e5fd2a106b17ffb9cc41048475607", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/4332b3003751c4ea6360e140a715c13a2e9792c3644a1f080a9d49a7de811f2ef803776a22fffdc1427a27c11bab289e4a96102d45721fc9c95cb0f3bd196c9c"} 06:12:46 INFO - Running post-run listener: copy_logs_to_upload_dir 06:12:46 INFO - Copying logs to upload dir... 06:12:46 INFO - mkdir: /builds/slave/test/build/upload/logs 06:12:46 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1236.788648 ========= master_lag: 0.05 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-05-21 06:12:46.275534) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-21 06:12:46.283174) ========= 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: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/4a81abf616a84979ed748c64bf3dcdb852540eeda01836961115bc38a2c46281e7ce394ac9d4bd696f258222a61591387b3e5fd2a106b17ffb9cc41048475607", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/4332b3003751c4ea6360e140a715c13a2e9792c3644a1f080a9d49a7de811f2ef803776a22fffdc1427a27c11bab289e4a96102d45721fc9c95cb0f3bd196c9c"} build_url:https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011117 build_url: 'https://queue.taskcluster.net/v1/task/UB6IXC1YTruJ-Z6Wqf2fMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/4a81abf616a84979ed748c64bf3dcdb852540eeda01836961115bc38a2c46281e7ce394ac9d4bd696f258222a61591387b3e5fd2a106b17ffb9cc41048475607", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/4332b3003751c4ea6360e140a715c13a2e9792c3644a1f080a9d49a7de811f2ef803776a22fffdc1427a27c11bab289e4a96102d45721fc9c95cb0f3bd196c9c"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-21 06:12:46.307729) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-21 06:12:46.308060) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=652eb03db935cfc1c15ebda0000001ad-1463834033.449737-247483954 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004461 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-21 06:12:46.393590) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-21 06:12:46.396958) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-21 06:12:46.397243) ========= ========= Total master_lag: 0.31 =========