builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-062 starttime: 1465219630.11 results: success (0) buildid: 20160602140837 builduid: 893fdbbbce3544769bc98c5128e2bb0b revision: 6e2399cf03e2f260740f6a0fc3f1fd0bc53b78ea ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-06 06:27:10.108289) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-06 06:27:10.108731) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-06 06:27:10.109000) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-06 06:27:10.123450) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 06:27:10.123751) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-06 06:27:10-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 104M=0s 2016-06-06 06:27:11 (104 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.107925 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 06:27:10.245184) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 06:27:10.245503) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014335 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 06:27:10.294342) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-06-06 06:27:10.294749) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 6e2399cf03e2f260740f6a0fc3f1fd0bc53b78ea --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 6e2399cf03e2f260740f6a0fc3f1fd0bc53b78ea --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=a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-06 06:27:11,206 truncating revision to first 12 chars 2016-06-06 06:27:11,206 Setting DEBUG logging. 2016-06-06 06:27:11,206 attempt 1/10 2016-06-06 06:27:11,206 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/6e2399cf03e2?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-06 06:27:12,259 unpacking tar archive at: mozilla-beta-6e2399cf03e2/testing/mozharness/ program finished with exit code 0 elapsedTime=1.373857 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-06-06 06:27:11.681282) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-06 06:27:11.681605) ========= script_repo_revision: 6e2399cf03e2f260740f6a0fc3f1fd0bc53b78ea ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-06 06:27:11.681987) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-06 06:27:11.682245) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-06 06:27:11.692483) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 23 secs) (at 2016-06-06 06:27:11.692753) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --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', '--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=a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 06:27:12 INFO - MultiFileLogger online at 20160606 06:27:12 in /builds/slave/test 06:27:12 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 06:27:12 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 06:27:12 INFO - {'append_to_log': False, 06:27:12 INFO - 'base_work_dir': '/builds/slave/test', 06:27:12 INFO - 'blob_upload_branch': 'Mozilla-Beta', 06:27:12 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 06:27:12 INFO - 'branch': 'Mozilla-Beta', 06:27:12 INFO - 'buildbot_json_path': 'buildprops.json', 06:27:12 INFO - 'config_files': ('talos/linux_config.py',), 06:27:12 INFO - 'default_actions': ('clobber', 06:27:12 INFO - 'read-buildbot-config', 06:27:12 INFO - 'download-and-extract', 06:27:12 INFO - 'populate-webroot', 06:27:12 INFO - 'create-virtualenv', 06:27:12 INFO - 'install', 06:27:12 INFO - 'run-tests'), 06:27:12 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:27:12 INFO - 'download_minidump_stackwalk': True, 06:27:12 INFO - 'download_symbols': 'ondemand', 06:27:12 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:27:12 INFO - 'tooltool.py': '/tools/tooltool.py', 06:27:12 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:27:12 INFO - '/tools/misc-python/virtualenv.py')}, 06:27:12 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:27:12 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:27:12 INFO - 'installer_path': 'installer.exe', 06:27:12 INFO - 'log_level': 'info', 06:27:12 INFO - 'log_name': 'talos', 06:27:12 INFO - 'log_to_console': True, 06:27:12 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 06:27:12 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 06:27:12 INFO - 'opt_config_files': (), 06:27:12 INFO - 'pip_index': False, 06:27:12 INFO - 'sps_profile': False, 06:27:12 INFO - 'sps_profile_interval': 0, 06:27:12 INFO - 'suite': 'dromaeojs', 06:27:12 INFO - 'system_bits': '32', 06:27:12 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:27:12 INFO - 'title': 'talos-linux64-ix-062', 06:27:12 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:27:12 INFO - 'use_talos_json': True, 06:27:12 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 06:27:12 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:27:12 INFO - 'work_dir': 'build'} 06:27:12 INFO - ##### 06:27:12 INFO - ##### Running clobber step. 06:27:12 INFO - ##### 06:27:12 INFO - Running pre-action listener: _resource_record_pre_action 06:27:12 INFO - Running main action method: clobber 06:27:12 INFO - rmtree: /builds/slave/test/build 06:27:12 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 06:27:13 INFO - Running post-action listener: _resource_record_post_action 06:27:13 INFO - ##### 06:27:13 INFO - ##### Running read-buildbot-config step. 06:27:13 INFO - ##### 06:27:13 INFO - Running pre-action listener: _resource_record_pre_action 06:27:13 INFO - Running main action method: read_buildbot_config 06:27:13 INFO - Using buildbot properties: 06:27:13 INFO - { 06:27:13 INFO - "project": "", 06:27:13 INFO - "product": "firefox", 06:27:13 INFO - "script_repo_revision": "production", 06:27:13 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs", 06:27:13 INFO - "repository": "", 06:27:13 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs", 06:27:13 INFO - "buildid": "20160602140837", 06:27:13 INFO - "pgo_build": "True", 06:27:13 INFO - "basedir": "/builds/slave/test", 06:27:13 INFO - "buildnumber": 119, 06:27:13 INFO - "slavename": "talos-linux64-ix-062", 06:27:13 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 06:27:13 INFO - "platform": "ubuntu64_hw", 06:27:13 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 06:27:13 INFO - "branch": "mozilla-beta", 06:27:13 INFO - "repo_path": "releases/mozilla-beta", 06:27:13 INFO - "revision": "6e2399cf03e2f260740f6a0fc3f1fd0bc53b78ea", 06:27:13 INFO - "stage_platform": "linux64-pgo", 06:27:13 INFO - "builduid": "893fdbbbce3544769bc98c5128e2bb0b", 06:27:13 INFO - "slavebuilddir": "test" 06:27:13 INFO - } 06:27:13 INFO - Found installer url https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2. 06:27:13 INFO - Running post-action listener: _resource_record_post_action 06:27:13 INFO - ##### 06:27:13 INFO - ##### Running download-and-extract step. 06:27:13 INFO - ##### 06:27:13 INFO - Running pre-action listener: _resource_record_pre_action 06:27:13 INFO - Running main action method: download_and_extract 06:27:13 INFO - mkdir: /builds/slave/test/build/tests 06:27:13 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')]} 06:27:13 INFO - https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 06:27:13 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 06:27:13 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 06:27:13 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/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 06:27:13 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/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 06:27:14 INFO - Downloaded 1412 bytes. 06:27:14 INFO - Reading from file /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 06:27:14 INFO - Using the following test package requirements: 06:27:14 INFO - {u'common': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 06:27:14 INFO - u'cppunittest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 06:27:14 INFO - u'firefox-47.0.en-US.linux-x86_64.cppunittest.tests.zip'], 06:27:14 INFO - u'gtest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 06:27:14 INFO - u'firefox-47.0.en-US.linux-x86_64.gtest.tests.zip'], 06:27:14 INFO - u'jittest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 06:27:14 INFO - u'jsshell-linux-x86_64.zip'], 06:27:14 INFO - u'mochitest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 06:27:14 INFO - u'firefox-47.0.en-US.linux-x86_64.mochitest.tests.zip'], 06:27:14 INFO - u'mozbase': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 06:27:14 INFO - u'reftest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 06:27:14 INFO - u'firefox-47.0.en-US.linux-x86_64.reftest.tests.zip'], 06:27:14 INFO - u'talos': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 06:27:14 INFO - u'firefox-47.0.en-US.linux-x86_64.talos.tests.zip'], 06:27:14 INFO - u'web-platform': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 06:27:14 INFO - u'firefox-47.0.en-US.linux-x86_64.web-platform.tests.zip'], 06:27:14 INFO - u'webapprt': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 06:27:14 INFO - u'xpcshell': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 06:27:14 INFO - u'firefox-47.0.en-US.linux-x86_64.xpcshell.tests.zip']} 06:27:14 INFO - Downloading packages: [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 06:27:14 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')]} 06:27:14 INFO - https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:27:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 06:27:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 06:27:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/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 06:27:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/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 06:27:15 INFO - Downloaded 23434647 bytes. 06:27:15 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'] 06:27:15 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 06:27:16 INFO - Return code: 0 06:27:16 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 06:27:16 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')]} 06:27:16 INFO - https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:27:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 06:27:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 06:27:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/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 06:27:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/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 06:27:18 INFO - Downloaded 23434647 bytes. 06:27:18 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'] 06:27:18 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 06:27:19 INFO - Return code: 0 06:27:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:19 INFO - https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 06:27:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 06:27:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 06:27:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/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 06:27:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/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 06:27:20 INFO - Downloaded 10845194 bytes. 06:27:20 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'] 06:27:20 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 06:27:21 INFO - Return code: 0 06:27:21 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')]} 06:27:21 INFO - https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 06:27:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 06:27:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 06:27:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/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 06:27:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/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 06:27:22 INFO - Downloaded 53855842 bytes. 06:27:22 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 06:27:22 INFO - mkdir: /builds/slave/test/properties 06:27:22 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 06:27:22 INFO - Writing to file /builds/slave/test/properties/build_url 06:27:22 INFO - Contents: 06:27:22 INFO - build_url:https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 06:27:23 INFO - Running post-action listener: _resource_record_post_action 06:27:23 INFO - Running post-action listener: set_extra_try_arguments 06:27:23 INFO - ##### 06:27:23 INFO - ##### Running populate-webroot step. 06:27:23 INFO - ##### 06:27:23 INFO - Running pre-action listener: _resource_record_pre_action 06:27:23 INFO - Running main action method: populate_webroot 06:27:23 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:27:23 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:27:23 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:27:23 INFO - '--tppagecycles', 06:27:23 INFO - '7'], 06:27:23 INFO - 'tests': ['tsvgm']}}, 06:27:23 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 06:27:23 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 06:27:23 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:27:23 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 06:27:23 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 06:27:23 INFO - 'tests': ['dromaeo_css', 'kraken']}, 06:27:23 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:27:23 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:27:23 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:27:23 INFO - 'talos_options': ['--e10s'], 06:27:23 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:27:23 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:27:23 INFO - 'tests': ['damp', 'tps']}, 06:27:23 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:27:23 INFO - 'talos_options': ['--e10s'], 06:27:23 INFO - 'tests': ['damp', 'tps']}, 06:27:23 INFO - 'g3': {'tests': ['dromaeo_dom']}, 06:27:23 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:27:23 INFO - 'other': {'tests': ['a11yr', 06:27:23 INFO - 'ts_paint', 06:27:23 INFO - 'tpaint', 06:27:23 INFO - 'sessionrestore', 06:27:23 INFO - 'sessionrestore_no_auto_restore', 06:27:23 INFO - 'tabpaint']}, 06:27:23 INFO - 'other-e10s': {'talos_options': ['--e10s'], 06:27:23 INFO - 'tests': ['a11yr', 06:27:23 INFO - 'ts_paint', 06:27:23 INFO - 'tpaint', 06:27:23 INFO - 'sessionrestore', 06:27:23 INFO - 'sessionrestore_no_auto_restore', 06:27:23 INFO - 'tabpaint']}, 06:27:23 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 06:27:23 INFO - 'tests': ['a11yr', 06:27:23 INFO - 'ts_paint', 06:27:23 INFO - 'tpaint', 06:27:23 INFO - 'sessionrestore', 06:27:23 INFO - 'sessionrestore_no_auto_restore', 06:27:23 INFO - 'tabpaint']}, 06:27:23 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 06:27:23 INFO - 'tests': ['a11yr', 06:27:23 INFO - 'ts_paint', 06:27:23 INFO - 'tpaint', 06:27:23 INFO - 'sessionrestore', 06:27:23 INFO - 'sessionrestore_no_auto_restore', 06:27:23 INFO - 'tabpaint']}, 06:27:23 INFO - 'other_l64': {'tests': ['a11yr', 06:27:23 INFO - 'ts_paint', 06:27:23 INFO - 'tpaint', 06:27:23 INFO - 'sessionrestore', 06:27:23 INFO - 'sessionrestore_no_auto_restore', 06:27:23 INFO - 'tabpaint']}, 06:27:23 INFO - 'other_nol64': {'tests': ['a11yr', 06:27:23 INFO - 'ts_paint', 06:27:23 INFO - 'tpaint', 06:27:23 INFO - 'sessionrestore', 06:27:23 INFO - 'sessionrestore_no_auto_restore', 06:27:23 INFO - 'tabpaint']}, 06:27:23 INFO - 'svgr': {'tests': ['tsvgx', 06:27:23 INFO - 'tsvgr_opacity', 06:27:23 INFO - 'tart', 06:27:23 INFO - 'tscrollx', 06:27:23 INFO - 'cart']}, 06:27:23 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 06:27:23 INFO - 'tests': ['tsvgx', 06:27:23 INFO - 'tsvgr_opacity', 06:27:23 INFO - 'tart', 06:27:23 INFO - 'tscrollx', 06:27:23 INFO - 'cart']}, 06:27:23 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:27:23 INFO - 'tests': ['tp5o']}, 06:27:23 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:27:23 INFO - 'talos_options': ['--e10s'], 06:27:23 INFO - 'tests': ['tp5o']}, 06:27:23 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:27:23 INFO - 'talos_options': ['--xperf_path', 06:27:23 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:27:23 INFO - 'tests': ['tp5n']}, 06:27:23 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:27:23 INFO - 'talos_options': ['--e10s', 06:27:23 INFO - '--xperf_path', 06:27:23 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:27:23 INFO - 'tests': ['tp5n']}}, 06:27:23 INFO - 'talos.zip': {'path': '', 06:27:23 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:27:23 INFO - Running post-action listener: _resource_record_post_action 06:27:23 INFO - ##### 06:27:23 INFO - ##### Running create-virtualenv step. 06:27:23 INFO - ##### 06:27:23 INFO - Running pre-action listener: _resource_record_pre_action 06:27:23 INFO - Running main action method: create_virtualenv 06:27:23 INFO - Creating virtualenv /builds/slave/test/build/venv 06:27:23 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 06:27:23 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 06:27:23 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:27:23 INFO - Using real prefix '/usr' 06:27:23 INFO - New python executable in /builds/slave/test/build/venv/bin/python 06:27:24 INFO - Installing distribute.............................................................................................................................................................................................done. 06:27:26 INFO - Installing pip.................done. 06:27:26 INFO - Return code: 0 06:27:26 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 06:27:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:26 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 0x7ff5334e1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d07160>, '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 0x2d08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d084f0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', '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 06:27:26 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 06:27:26 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 06:27:26 INFO - Using env: {'DISPLAY': ':0', 06:27:26 INFO - 'HOME': '/home/cltbld', 06:27:26 INFO - 'LANG': 'en_US.UTF-8', 06:27:26 INFO - 'LANGUAGE': 'en_US:en', 06:27:26 INFO - 'LOGNAME': 'cltbld', 06:27:26 INFO - 'MAIL': '/var/mail/cltbld', 06:27:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:26 INFO - 'MOZ_NO_REMOTE': '1', 06:27:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:26 INFO - 'NO_EM_RESTART': '1', 06:27:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:27:26 INFO - 'PWD': '/builds/slave/test', 06:27:26 INFO - 'SHELL': '/bin/bash', 06:27:26 INFO - 'SHLVL': '1', 06:27:26 INFO - 'TERM': 'linux', 06:27:26 INFO - 'TMOUT': '86400', 06:27:26 INFO - 'USER': 'cltbld', 06:27:26 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', 06:27:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:26 INFO - '_': '/tools/buildbot/bin/python'} 06:27:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:26 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 06:27:26 INFO - Cleaning up... 06:27:26 INFO - Return code: 0 06:27:26 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 06:27:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:26 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 0x7ff5334e1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d07160>, '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 0x2d08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d084f0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', '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 06:27:26 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 06:27:26 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 06:27:26 INFO - Using env: {'DISPLAY': ':0', 06:27:26 INFO - 'HOME': '/home/cltbld', 06:27:26 INFO - 'LANG': 'en_US.UTF-8', 06:27:26 INFO - 'LANGUAGE': 'en_US:en', 06:27:26 INFO - 'LOGNAME': 'cltbld', 06:27:26 INFO - 'MAIL': '/var/mail/cltbld', 06:27:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:26 INFO - 'MOZ_NO_REMOTE': '1', 06:27:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:26 INFO - 'NO_EM_RESTART': '1', 06:27:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:27:26 INFO - 'PWD': '/builds/slave/test', 06:27:26 INFO - 'SHELL': '/bin/bash', 06:27:26 INFO - 'SHLVL': '1', 06:27:26 INFO - 'TERM': 'linux', 06:27:26 INFO - 'TMOUT': '86400', 06:27:26 INFO - 'USER': 'cltbld', 06:27:26 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', 06:27:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:26 INFO - '_': '/tools/buildbot/bin/python'} 06:27:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:26 INFO - Downloading/unpacking psutil>=0.7.1 06:27:26 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 06:27:26 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 06:27:26 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 06:27:26 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 06:27:26 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 06:27:26 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 06:27:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 06:27:28 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:27:28 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:27:28 INFO - Installing collected packages: psutil 06:27:28 INFO - Running setup.py install for psutil 06:27:28 INFO - building 'psutil._psutil_linux' extension 06:27:28 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 06:27:28 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 06:27:28 INFO - building 'psutil._psutil_posix' extension 06:27:28 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 06:27:28 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 06:27:29 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:27:29 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:27:29 INFO - Successfully installed psutil 06:27:29 INFO - Cleaning up... 06:27:29 INFO - Return code: 0 06:27:29 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 06:27:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:29 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 0x7ff5334e1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d07160>, '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 0x2d08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d084f0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', '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 06:27:29 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 06:27:29 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 06:27:29 INFO - Using env: {'DISPLAY': ':0', 06:27:29 INFO - 'HOME': '/home/cltbld', 06:27:29 INFO - 'LANG': 'en_US.UTF-8', 06:27:29 INFO - 'LANGUAGE': 'en_US:en', 06:27:29 INFO - 'LOGNAME': 'cltbld', 06:27:29 INFO - 'MAIL': '/var/mail/cltbld', 06:27:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:29 INFO - 'MOZ_NO_REMOTE': '1', 06:27:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:29 INFO - 'NO_EM_RESTART': '1', 06:27:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:27:29 INFO - 'PWD': '/builds/slave/test', 06:27:29 INFO - 'SHELL': '/bin/bash', 06:27:29 INFO - 'SHLVL': '1', 06:27:29 INFO - 'TERM': 'linux', 06:27:29 INFO - 'TMOUT': '86400', 06:27:29 INFO - 'USER': 'cltbld', 06:27:29 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', 06:27:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:29 INFO - '_': '/tools/buildbot/bin/python'} 06:27:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:29 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 06:27:29 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 06:27:29 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 06:27:29 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 06:27:29 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 06:27:29 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 06:27:29 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 06:27:31 INFO - Downloading mozsystemmonitor-0.0.tar.gz 06:27:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:27:31 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 06:27:31 INFO - Installing collected packages: mozsystemmonitor 06:27:31 INFO - Running setup.py install for mozsystemmonitor 06:27:31 INFO - Successfully installed mozsystemmonitor 06:27:31 INFO - Cleaning up... 06:27:31 INFO - Return code: 0 06:27:31 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 06:27: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')]} 06:27:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27: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')]} 06:27:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:31 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 0x7ff5334e1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d07160>, '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 0x2d08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d084f0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', '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 06:27:31 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 06:27:31 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 06:27:31 INFO - Using env: {'DISPLAY': ':0', 06:27:31 INFO - 'HOME': '/home/cltbld', 06:27:31 INFO - 'LANG': 'en_US.UTF-8', 06:27:31 INFO - 'LANGUAGE': 'en_US:en', 06:27:31 INFO - 'LOGNAME': 'cltbld', 06:27:31 INFO - 'MAIL': '/var/mail/cltbld', 06:27:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:31 INFO - 'MOZ_NO_REMOTE': '1', 06:27:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:31 INFO - 'NO_EM_RESTART': '1', 06:27:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:27:31 INFO - 'PWD': '/builds/slave/test', 06:27:31 INFO - 'SHELL': '/bin/bash', 06:27:31 INFO - 'SHLVL': '1', 06:27:31 INFO - 'TERM': 'linux', 06:27:31 INFO - 'TMOUT': '86400', 06:27:31 INFO - 'USER': 'cltbld', 06:27:31 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', 06:27:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:31 INFO - '_': '/tools/buildbot/bin/python'} 06:27:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:31 INFO - Downloading/unpacking blobuploader==1.2.4 06:27:31 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 06:27:31 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 06:27:31 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 06:27:31 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 06:27:31 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 06:27:31 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 06:27:33 INFO - Downloading blobuploader-1.2.4.tar.gz 06:27:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:27:33 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:27:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 06:27:34 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:27:34 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 06:27:34 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 06:27:34 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 06:27:34 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 06:27:34 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 06:27:34 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 06:27:34 INFO - Downloading docopt-0.6.1.tar.gz 06:27:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 06:27:34 INFO - Installing collected packages: blobuploader, requests, docopt 06:27:34 INFO - Running setup.py install for blobuploader 06:27:34 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:27:34 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 06:27:34 INFO - Running setup.py install for requests 06:27:34 INFO - Running setup.py install for docopt 06:27:34 INFO - Successfully installed blobuploader requests docopt 06:27:34 INFO - Cleaning up... 06:27:35 INFO - Return code: 0 06:27:35 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:27:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:27:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff5334e1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d07160>, '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 0x2d08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d084f0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', '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 06:27:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 06:27:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:27:35 INFO - Using env: {'DISPLAY': ':0', 06:27:35 INFO - 'HOME': '/home/cltbld', 06:27:35 INFO - 'LANG': 'en_US.UTF-8', 06:27:35 INFO - 'LANGUAGE': 'en_US:en', 06:27:35 INFO - 'LOGNAME': 'cltbld', 06:27:35 INFO - 'MAIL': '/var/mail/cltbld', 06:27:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:35 INFO - 'MOZ_NO_REMOTE': '1', 06:27:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:35 INFO - 'NO_EM_RESTART': '1', 06:27:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:27:35 INFO - 'PWD': '/builds/slave/test', 06:27:35 INFO - 'SHELL': '/bin/bash', 06:27:35 INFO - 'SHLVL': '1', 06:27:35 INFO - 'TERM': 'linux', 06:27:35 INFO - 'TMOUT': '86400', 06:27:35 INFO - 'USER': 'cltbld', 06:27:35 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', 06:27:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:35 INFO - '_': '/tools/buildbot/bin/python'} 06:27:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:27:35 INFO - Running setup.py (path:/tmp/pip-nWpKoW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:27:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:27:35 INFO - Running setup.py (path:/tmp/pip-l56s7Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:27:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:27:35 INFO - Running setup.py (path:/tmp/pip-1UB0tB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:27:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:27:35 INFO - Running setup.py (path:/tmp/pip-wcFblB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:27:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:27:35 INFO - Running setup.py (path:/tmp/pip-ceAHww-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:27:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:27:35 INFO - Running setup.py (path:/tmp/pip-lmPCxE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:27:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:27:35 INFO - Running setup.py (path:/tmp/pip-83bgfw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:27:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:27:35 INFO - Running setup.py (path:/tmp/pip-eYuQDq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:27:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:27:35 INFO - Running setup.py (path:/tmp/pip-MEUsKS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:27:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:27:35 INFO - Running setup.py (path:/tmp/pip-QF1qFN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:27:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:27:35 INFO - Running setup.py (path:/tmp/pip-TZvbkV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:27:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:27:36 INFO - Running setup.py (path:/tmp/pip-Cg_LsN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:27:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:27:36 INFO - Running setup.py (path:/tmp/pip-0DcyO6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:27:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:27:36 INFO - Running setup.py (path:/tmp/pip-8EmOKo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:27:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:27:36 INFO - Running setup.py (path:/tmp/pip-FD4Dio-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:27:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:27:36 INFO - Running setup.py (path:/tmp/pip-eNB6gB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:27:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:27:36 INFO - Running setup.py (path:/tmp/pip-lPKM7h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:27:36 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 06:27:36 INFO - Running setup.py install for manifestparser 06:27:36 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 06:27:36 INFO - Running setup.py install for mozcrash 06:27:36 INFO - Running setup.py install for mozdebug 06:27:36 INFO - Running setup.py install for mozdevice 06:27:36 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 06:27:36 INFO - Installing dm script to /builds/slave/test/build/venv/bin 06:27:36 INFO - Running setup.py install for mozfile 06:27:37 INFO - Running setup.py install for mozhttpd 06:27:37 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 06:27:37 INFO - Running setup.py install for mozinfo 06:27:37 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 06:27:37 INFO - Running setup.py install for mozInstall 06:27:37 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 06:27:37 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 06:27:37 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 06:27:37 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 06:27:37 INFO - Running setup.py install for mozleak 06:27:37 INFO - Running setup.py install for mozlog 06:27:37 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 06:27:37 INFO - Running setup.py install for moznetwork 06:27:37 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 06:27:37 INFO - Running setup.py install for mozprocess 06:27:37 INFO - Running setup.py install for mozprofile 06:27:37 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 06:27:37 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 06:27:37 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 06:27:37 INFO - Running setup.py install for mozrunner 06:27:37 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 06:27:37 INFO - Running setup.py install for mozscreenshot 06:27:38 INFO - Running setup.py install for moztest 06:27:38 INFO - Running setup.py install for mozversion 06:27:38 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 06:27:38 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 06:27:38 INFO - Cleaning up... 06:27:38 INFO - Return code: 0 06:27:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:27:38 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')]} 06:27:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:38 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')]} 06:27:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:38 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 0x7ff5334e1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d07160>, '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 0x2d08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d084f0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', '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 06:27:38 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 06:27:38 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 06:27:38 INFO - Using env: {'DISPLAY': ':0', 06:27:38 INFO - 'HOME': '/home/cltbld', 06:27:38 INFO - 'LANG': 'en_US.UTF-8', 06:27:38 INFO - 'LANGUAGE': 'en_US:en', 06:27:38 INFO - 'LOGNAME': 'cltbld', 06:27:38 INFO - 'MAIL': '/var/mail/cltbld', 06:27:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:38 INFO - 'MOZ_NO_REMOTE': '1', 06:27:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:38 INFO - 'NO_EM_RESTART': '1', 06:27:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:27:38 INFO - 'PWD': '/builds/slave/test', 06:27:38 INFO - 'SHELL': '/bin/bash', 06:27:38 INFO - 'SHLVL': '1', 06:27:38 INFO - 'TERM': 'linux', 06:27:38 INFO - 'TMOUT': '86400', 06:27:38 INFO - 'USER': 'cltbld', 06:27:38 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', 06:27:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:38 INFO - '_': '/tools/buildbot/bin/python'} 06:27:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:27:38 INFO - Running setup.py (path:/tmp/pip-fXLvcz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:27:38 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)) 06:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:27:38 INFO - Running setup.py (path:/tmp/pip-lgeUIb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:27:38 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)) 06:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:27:38 INFO - Running setup.py (path:/tmp/pip-IcyYW0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:27:38 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)) 06:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:27:38 INFO - Running setup.py (path:/tmp/pip-FqeGWP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:27:38 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)) 06:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:27:38 INFO - Running setup.py (path:/tmp/pip-0axqq5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:27:38 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)) 06:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:27:38 INFO - Running setup.py (path:/tmp/pip-fVcmKY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:27:38 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)) 06:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:27:38 INFO - Running setup.py (path:/tmp/pip-hjehKG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:27:38 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)) 06:27:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:27:38 INFO - Running setup.py (path:/tmp/pip-yS0kCy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:27:39 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)) 06:27:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:27:39 INFO - Running setup.py (path:/tmp/pip-vVquxk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:27:39 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)) 06:27:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:27:39 INFO - Running setup.py (path:/tmp/pip-Xpjamy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:27:39 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)) 06:27:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:27:39 INFO - Running setup.py (path:/tmp/pip-391xRL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:27:39 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)) 06:27:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:27:39 INFO - Running setup.py (path:/tmp/pip-oI8BKE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:27:39 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)) 06:27:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:27:39 INFO - Running setup.py (path:/tmp/pip-sjCfnB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:27:39 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)) 06:27:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:27:39 INFO - Running setup.py (path:/tmp/pip-pTcKGF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:27:39 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)) 06:27:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:27:39 INFO - Running setup.py (path:/tmp/pip-6P7SMo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:27:39 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)) 06:27:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:27:39 INFO - Running setup.py (path:/tmp/pip-2lYTKS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:27:39 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)) 06:27:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:27:39 INFO - Running setup.py (path:/tmp/pip-QfxrSF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:27:39 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)) 06:27:39 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)) 06:27:39 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)) 06:27:39 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)) 06:27:39 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)) 06:27:39 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)) 06:27:39 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:27:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:41 INFO - Downloading blessings-1.6.tar.gz 06:27:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 06:27:41 INFO - Installing collected packages: blessings 06:27:41 INFO - Running setup.py install for blessings 06:27:41 INFO - Successfully installed blessings 06:27:41 INFO - Cleaning up... 06:27:41 INFO - Return code: 0 06:27:41 INFO - Done creating virtualenv /builds/slave/test/build/venv. 06:27:41 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:27:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:27:42 INFO - Reading from file tmpfile_stdout 06:27:42 INFO - Current package versions: 06:27:42 INFO - argparse == 1.2.1 06:27:42 INFO - blessings == 1.6 06:27:42 INFO - blobuploader == 1.2.4 06:27:42 INFO - docopt == 0.6.1 06:27:42 INFO - manifestparser == 1.1 06:27:42 INFO - mozInstall == 1.12 06:27:42 INFO - mozcrash == 0.17 06:27:42 INFO - mozdebug == 0.1 06:27:42 INFO - mozdevice == 0.48 06:27:42 INFO - mozfile == 1.2 06:27:42 INFO - mozhttpd == 0.7 06:27:42 INFO - mozinfo == 0.9 06:27:42 INFO - mozleak == 0.1 06:27:42 INFO - mozlog == 3.1 06:27:42 INFO - moznetwork == 0.27 06:27:42 INFO - mozprocess == 0.22 06:27:42 INFO - mozprofile == 0.28 06:27:42 INFO - mozrunner == 6.11 06:27:42 INFO - mozscreenshot == 0.1 06:27:42 INFO - mozsystemmonitor == 0.0 06:27:42 INFO - moztest == 0.7 06:27:42 INFO - mozversion == 1.4 06:27:42 INFO - psutil == 3.1.1 06:27:42 INFO - requests == 1.2.3 06:27:42 INFO - wsgiref == 0.1.2 06:27:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:27: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')]} 06:27:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27: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')]} 06:27:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:42 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 0x7ff5334e1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d07160>, '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 0x2d08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d084f0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', '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 06:27:42 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 06:27:42 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 06:27:42 INFO - Using env: {'DISPLAY': ':0', 06:27:42 INFO - 'HOME': '/home/cltbld', 06:27:42 INFO - 'LANG': 'en_US.UTF-8', 06:27:42 INFO - 'LANGUAGE': 'en_US:en', 06:27:42 INFO - 'LOGNAME': 'cltbld', 06:27:42 INFO - 'MAIL': '/var/mail/cltbld', 06:27:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:42 INFO - 'MOZ_NO_REMOTE': '1', 06:27:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:42 INFO - 'NO_EM_RESTART': '1', 06:27:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:27:42 INFO - 'PWD': '/builds/slave/test', 06:27:42 INFO - 'SHELL': '/bin/bash', 06:27:42 INFO - 'SHLVL': '1', 06:27:42 INFO - 'TERM': 'linux', 06:27:42 INFO - 'TMOUT': '86400', 06:27:42 INFO - 'USER': 'cltbld', 06:27:42 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', 06:27:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:42 INFO - '_': '/tools/buildbot/bin/python'} 06:27:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:42 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)) 06:27:42 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)) 06:27:42 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)) 06:27:42 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)) 06:27:42 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)) 06:27:42 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)) 06:27:42 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)) 06:27:42 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)) 06:27:42 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)) 06:27:42 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)) 06:27:42 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)) 06:27:42 INFO - Cleaning up... 06:27:42 INFO - Return code: 0 06:27:42 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 06:27: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')]} 06:27:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27: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')]} 06:27:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff5334e1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d07160>, '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 0x2d08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d084f0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', '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 06:27: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', 'jsonschema'] in /builds/slave/test/build 06:27: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 jsonschema 06:27:42 INFO - Using env: {'DISPLAY': ':0', 06:27:42 INFO - 'HOME': '/home/cltbld', 06:27:42 INFO - 'LANG': 'en_US.UTF-8', 06:27:42 INFO - 'LANGUAGE': 'en_US:en', 06:27:42 INFO - 'LOGNAME': 'cltbld', 06:27:42 INFO - 'MAIL': '/var/mail/cltbld', 06:27:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:42 INFO - 'MOZ_NO_REMOTE': '1', 06:27:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:42 INFO - 'NO_EM_RESTART': '1', 06:27:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:27:42 INFO - 'PWD': '/builds/slave/test', 06:27:42 INFO - 'SHELL': '/bin/bash', 06:27:42 INFO - 'SHLVL': '1', 06:27:42 INFO - 'TERM': 'linux', 06:27:42 INFO - 'TMOUT': '86400', 06:27:42 INFO - 'USER': 'cltbld', 06:27:42 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', 06:27:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:42 INFO - '_': '/tools/buildbot/bin/python'} 06:27:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:42 INFO - Downloading/unpacking jsonschema 06:27: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 06:27: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 06:27: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 06:27: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 06:27: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 06:27: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 06:27:44 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 06:27:44 INFO - Downloading/unpacking functools32 (from jsonschema) 06:27: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 06:27: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 06:27: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 06:27: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 06:27: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 06:27: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 06:27:44 INFO - Downloading functools32-3.2.3-2.tar.gz 06:27:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 06:27:44 INFO - warning: no files found matching '*.txt' 06:27:44 INFO - no previously-included directories found matching 'build' 06:27:44 INFO - no previously-included directories found matching 'dist' 06:27:44 INFO - no previously-included directories found matching '.git*' 06:27:44 INFO - Installing collected packages: jsonschema, functools32 06:27:44 INFO - Running setup.py install for functools32 06:27:44 INFO - warning: no files found matching '*.txt' 06:27:44 INFO - no previously-included directories found matching 'build' 06:27:44 INFO - no previously-included directories found matching 'dist' 06:27:44 INFO - no previously-included directories found matching '.git*' 06:27:44 INFO - Successfully installed jsonschema functools32 06:27:44 INFO - Cleaning up... 06:27:44 INFO - Return code: 0 06:27:44 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 06:27:44 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')]} 06:27:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:27:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:44 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')]} 06:27:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:27:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:27:44 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 0x7ff5334e1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bab8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c78410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d07160>, '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 0x2d08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d084f0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', '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 06:27:44 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 06:27:44 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 06:27:44 INFO - Using env: {'DISPLAY': ':0', 06:27:44 INFO - 'HOME': '/home/cltbld', 06:27:44 INFO - 'LANG': 'en_US.UTF-8', 06:27:44 INFO - 'LANGUAGE': 'en_US:en', 06:27:44 INFO - 'LOGNAME': 'cltbld', 06:27:44 INFO - 'MAIL': '/var/mail/cltbld', 06:27:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:27:44 INFO - 'MOZ_NO_REMOTE': '1', 06:27:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:27:44 INFO - 'NO_EM_RESTART': '1', 06:27:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:27:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:27:44 INFO - 'PWD': '/builds/slave/test', 06:27:44 INFO - 'SHELL': '/bin/bash', 06:27:44 INFO - 'SHLVL': '1', 06:27:44 INFO - 'TERM': 'linux', 06:27:44 INFO - 'TMOUT': '86400', 06:27:44 INFO - 'USER': 'cltbld', 06:27:44 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', 06:27:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:27:44 INFO - '_': '/tools/buildbot/bin/python'} 06:27:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:27:45 INFO - Downloading/unpacking flake8 06:27: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 06:27: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 06:27: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 06:27: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 06:27: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 06:27: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 06:27:46 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 06:27:46 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 06:27:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:47 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 06:27:47 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 06:27:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:47 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 06:27:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:27:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:27:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:27:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 06:27:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 06:27:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 06:27:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 06:27:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 06:27:47 INFO - no previously-included directories found matching 'docs/_build' 06:27:47 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 06:27:47 INFO - Running setup.py install for pep8 06:27:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 06:27:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 06:27:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 06:27:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 06:27:47 INFO - no previously-included directories found matching 'docs/_build' 06:27:47 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 06:27:47 INFO - Successfully installed flake8 mccabe pyflakes pep8 06:27:47 INFO - Cleaning up... 06:27:47 INFO - Return code: 0 06:27:47 INFO - Running post-action listener: _resource_record_post_action 06:27:47 INFO - Running post-action listener: _start_resource_monitoring 06:27:47 INFO - Starting resource monitoring. 06:27:47 INFO - ##### 06:27:47 INFO - ##### Running install step. 06:27:47 INFO - ##### 06:27:47 INFO - Running pre-action listener: _resource_record_pre_action 06:27:47 INFO - Running main action method: install 06:27:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:27:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:27:48 INFO - Reading from file tmpfile_stdout 06:27:48 INFO - Detecting whether we're running mozinstall >=1.0... 06:27:48 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 06:27:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 06:27:48 INFO - Reading from file tmpfile_stdout 06:27:48 INFO - Output received: 06:27:48 INFO - Usage: mozinstall [options] installer 06:27:48 INFO - Options: 06:27:48 INFO - -h, --help show this help message and exit 06:27:48 INFO - -d DEST, --destination=DEST 06:27:48 INFO - Directory to install application into. [default: 06:27:48 INFO - "/builds/slave/test"] 06:27:48 INFO - --app=APP Application being installed. [default: firefox] 06:27:48 INFO - mkdir: /builds/slave/test/build/application 06:27:48 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'] 06:27:48 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 06:28:00 INFO - Reading from file tmpfile_stdout 06:28:00 INFO - Output received: 06:28:00 INFO - /builds/slave/test/build/application/firefox/firefox 06:28:00 INFO - Running post-action listener: _resource_record_post_action 06:28:00 INFO - ##### 06:28:00 INFO - ##### Running run-tests step. 06:28:00 INFO - ##### 06:28:00 INFO - Running pre-action listener: _resource_record_pre_action 06:28:01 INFO - Running main action method: run_tests 06:28:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 06:28:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 06:28:01 INFO - Python 2.7.3 06:28:01 INFO - Return code: 0 06:28:01 INFO - grabbing minidump binary from tooltool 06:28:01 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')]} 06:28:01 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 0x2d07160>, '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 0x2d08060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d084f0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 06:28:01 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 06:28:01 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 06:28:01 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 06:28:01 INFO - Return code: 0 06:28:01 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 06:28:01 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 06:28:01 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 06:28:01 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 06:28:01 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 06:28:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 06:28:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 06:28:02 INFO - Return code: 0 06:28:02 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', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 06:28:02 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 --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-062 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 06:28:02 INFO - Using env: {'DISPLAY': ':0', 06:28:02 INFO - 'HOME': '/home/cltbld', 06:28:02 INFO - 'LANG': 'en_US.UTF-8', 06:28:02 INFO - 'LANGUAGE': 'en_US:en', 06:28:02 INFO - 'LOGNAME': 'cltbld', 06:28:02 INFO - 'MAIL': '/var/mail/cltbld', 06:28:02 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 06:28:02 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 06:28:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:28:02 INFO - 'MOZ_NO_REMOTE': '1', 06:28:02 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 06:28:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:28:02 INFO - 'NO_EM_RESTART': '1', 06:28:02 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:28:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:28:02 INFO - 'PWD': '/builds/slave/test', 06:28:02 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 06:28:02 INFO - 'SHELL': '/bin/bash', 06:28:02 INFO - 'SHLVL': '1', 06:28:02 INFO - 'TERM': 'linux', 06:28:02 INFO - 'TMOUT': '86400', 06:28:02 INFO - 'USER': 'cltbld', 06:28:02 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051', 06:28:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:28:02 INFO - '_': '/tools/buildbot/bin/python'} 06:28:02 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 06:28:02 INFO - mozversion application_buildid: 20160602140837 06:28:02 INFO - mozversion application_changeset: 6e2399cf03e2f260740f6a0fc3f1fd0bc53b78ea 06:28:02 INFO - mozversion application_display_name: Firefox 06:28:02 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 06:28:02 INFO - mozversion application_name: Firefox 06:28:02 INFO - mozversion application_remotingname: firefox 06:28:02 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 06:28:02 INFO - mozversion application_vendor: Mozilla 06:28:02 INFO - mozversion application_version: 47.0 06:28:02 INFO - mozversion platform_buildid: 20160602140837 06:28:02 INFO - mozversion platform_changeset: 6e2399cf03e2f260740f6a0fc3f1fd0bc53b78ea 06:28:02 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 06:28:02 INFO - mozversion platform_version: 47.0 06:28:02 INFO - using testdate: 1465219682 06:28:02 INFO - actual date: 1465219682 06:28:02 INFO - starting webserver on 'localhost:55000' 06:28:02 INFO - SUITE-START | Running 2 tests 06:28:02 INFO - TEST-START | dromaeo_css 06:28:02 INFO - operating with platform_type : linux_ 06:28:02 INFO - Initialising browser for dromaeo_css test... 06:28:02 INFO - TEST-INFO | started process 25469 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpOgsQ8G/profile http://localhost:55000/getInfo.html) 06:28:06 INFO - PROCESS | 25469 | __metrics Screen width/height:1600/1200 06:28:06 INFO - PROCESS | 25469 | colorDepth:24 06:28:06 INFO - PROCESS | 25469 | Browser inner width/height: 1024/697 06:28:06 INFO - PROCESS | 25469 | __metrics 06:28:07 INFO - PROCESS | 25469 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 06:28:08 INFO - TEST-INFO | 25469: exit 0 06:28:08 INFO - Browser initialized. 06:28:08 INFO - Running cycle 1/1 for dromaeo_css test... 06:28:08 INFO - TEST-INFO | started process 25557 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpOgsQ8G/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:28:19 INFO - PROCESS | 25557 | RSS: Main: 139313152 06:28:19 INFO - PROCESS | 25557 | 06:29:10 INFO - PROCESS | 25557 | 1465219750859 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] 06:31:18 INFO - PROCESS | 25557 | Cycle 1(1): loaded http://localhost:55000/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55000/tests/dromaeo/cssquery-ext.html) 06:31:19 INFO - PROCESS | 25557 | RSS: Main: 254889984 06:31:19 INFO - PROCESS | 25557 | 06:34:21 INFO - PROCESS | 25557 | Cycle 1(1): loaded http://localhost:55000/tests/dromaeo/cssquery-ext.html (next: http://localhost:55000/tests/dromaeo/cssquery-jquery.html) 06:34:22 INFO - PROCESS | 25557 | RSS: Main: 229494784 06:34:22 INFO - PROCESS | 25557 | 06:37:24 INFO - PROCESS | 25557 | Cycle 1(1): loaded http://localhost:55000/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55000/tests/dromaeo/cssquery-mootools.html) 06:37:24 INFO - PROCESS | 25557 | RSS: Main: 237883392 06:37:24 INFO - PROCESS | 25557 | 06:40:26 INFO - PROCESS | 25557 | Cycle 1(1): loaded http://localhost:55000/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55000/tests/dromaeo/cssquery-prototype.html) 06:40:26 INFO - PROCESS | 25557 | RSS: Main: 211517440 06:40:26 INFO - PROCESS | 25557 | 06:43:29 INFO - PROCESS | 25557 | Cycle 1(1): loaded http://localhost:55000/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55000/tests/dromaeo/cssquery-yui.html) 06:43:30 INFO - PROCESS | 25557 | RSS: Main: 212037632 06:43:30 INFO - PROCESS | 25557 | 06:46:32 INFO - PROCESS | 25557 | Cycle 1(1): loaded http://localhost:55000/tests/dromaeo/cssquery-yui.html (next: http://localhost:55000/tests/dromaeo/cssquery-dojo.html) 06:46:32 INFO - PROCESS | 25557 | RSS: Main: 255528960 06:46:32 INFO - PROCESS | 25557 | 06:46:32 INFO - PROCESS | 25557 | __start_tp_report 06:46:32 INFO - PROCESS | 25557 | _x_x_mozilla_page_load 06:46:32 INFO - PROCESS | 25557 | _x_x_mozilla_page_load_details 06:46:32 INFO - PROCESS | 25557 | |i|pagename|runs| 06:46:32 INFO - PROCESS | 25557 | |0;dojo.html;3282.2122690554265;3336.7831090979084;3361;3361.411752943234;3382.5264462975188;5330.827218012036;5372.113601255793;5373.596980226479;5389.191621256813;5393.325834270716;5362.24928510008;5368.516833484986;5391.083515802313;5410.513053825155;5419.810306639269;4843.225083986563;4869.366982292297;4916.262560615918;4948.7278199699;5023.598112151019;4846.660733748621;4858.854234372974;4919.852404427855;4948.777305021283;4970.179920313144;4917.877053073666;4941.4811444798315;4952.158133117361;4963.057019166365;4974.37820272466;4752.477227504972;4888.975555122237;4906.239532872411;4932.408111026682;4941.85174444769;4774.28385742138;4815.374001379833;4835.419749630032;4858.368412106403;4864.683795553277;5190.532852043297;5248.816291429782;5274.736263186825;5326.893462130774;5331.1470164773455;5618.904313658838;5711.742971566289;5716.771329146829;5780.075187969905;5799.39106393831;5710.942890571083;5727.971360143214;5745.6552606843725;5758.769649214027;5777.537796976232;5298.231756395301;5324.653897496689;5331.973340133274;5354;5360;5678.261825962599;5738.713064346766;5820.330661973927;5840.83183363329;5847.210626565445;5716.399778023331;5718.828435146952;5719.685417302088;5729.4843464088435;5738.885222295531;5754.1944127822135;5771.740271687784;5806.274215723035;5836.416358364129;5843.883122337529;5635.605507614509;5745;5767.22142510764;5800.83983203361;5824.767009319579;5573.7770489179975;5575.665460072409;5578.30271216098;5585.720713964285;5602.159676048625;4265.168292182994;4288.1638080573985;4289.420928174719;4290.742555446684;4294.334378171388;3906.5507466641134;3950.071733142709;3991.3015222336558;3993.101552150743;4019.718619696593;5475.233467314579;5479.123340265538;5497.670139791545;5506.449355064461;5537.031019571639;5719.742611582489;5797.565182611321;5815.796447124415;5816.2148110005455;5816.331121920949;5504.834854954358;5525.696086715269;5561.888762224814;5579.191017302468;5602.915956260659;4907.214845624683;4907.950920490749;4910.337104490919;4911.68074075184;4946.802127914843;5857.26784151981;5864.296284445809;5871.3541510433815;5906.232189815297;5907.172995780594;5729.255196824386;5754.079347304411;5772.191893135048;5772.365039845529;5779.913301300568;5876.559258055578;5918.408159184047;5928.170056192223;5931.822045338647;5944.940550594439;5536.141898005815;5587.860303492445;5672;5701.315842098975;5766.8846623066465;5824.330202026821;5836.299644042742;5841.32824725162;5844.444777746107;5847.035239185487;5629.831105066854;5669.574781891292;5671.291088613923;5678.4605462480995;5684.204211410323;5529.917051244315;5626.099824028136;5649.293838270216;5679.432056794288;5721.113227449752;5586.16207568868;5612.102063669793;5629.268195134607;5630.549556035589;5640.633358831663;5715.771369145354;5747.712614369349;5749.54003679713;5761.078227483583;5762.1068734346245;5453.836384908459;5532.253145825262;5545.750441230073;5610.270664813711;5627.43725627434 06:46:32 INFO - PROCESS | 25557 | |1;ext.html;541.4909984614462;544.3467838593689;547.4798941006044;548.7667741209988;567.3503838105366;31654.52518212226;40100.39849402258;40401.595984040185;40402;40782.79608601953;43301.783491082504;43709.7814510927;43817.78091109548;43935.56064439355;44025;8910;9123.133302336268;9133.634654613808;9133.862992055092;9134.954325228364;8924.955375223115;9058.27533797298;9069.637214511444;9077.591508382138;9081.364304498687;9239.122283383067;9309.627614895397;9320.347575669706;9330.346875718702;9332.48671323077;9184.311176661744;9270.72187834366;9279;9290.814183716355;9291.674791382304;9177.128172823572;9313.161815436642;9322.533873306307;9328.533573321307;9330.393524420891;44036.779816100716;44488.11023779539;44548.77725611351;44616.3307550387;44640.55359446396;3450.2236996675797;3481.1993241554583;3618.258257057323;4086.1010577672864;4235.449391579075;32991;33286.66713332884;33793.493097603554;34108.48837267443;34347;4066.593340665939;4122.855700050483;4138.0689344897155;4150.813213405404;4199.454070970754;303107;303552;304310.9999999978;304480;304974;46556.301655475196;47295.5270447298;65975.67012165005;66961.66519167373;67019.32980670131;45565.544344556794;45589;45868.31197531973;45873.311900321525;45882.54117458849;16094.678106437806;16232.513024609281;16243.837561624232;16244.431444899372;16281.185940702917;13839.100458470168;13912;13914.443422262995;13956.790648140286;13995.790063149061;15745.212739362985;15877.364905403654;15895;15900.284487198103;15903.204839757966;5779;5834.445727655866;5850.912236316459;5967.030879809652;6011.27864656244;990.5245482168456;1026.9024442677933;1040.5785656809005;1178.5344788808545;1205.2346759807585;29793.255168620526;30137.246568835955;30454.238644034078;30738;30990.22524436907;1031.7936412717486;1096.3641088169002;1132.394169119517;1161.1233518693332;1292.6445227562494;14730.410783568752;15017.549473515812;15592.766108508382;15711.68576628461;15712.92143539275;416002;419143;419900;422002;423310;60297.397026029175;60769.39230607637;60867.39132608706;60994;61133;1325.7812460943837;1401.5935378740255;1450.7461194290956;1474.5207807462618;1500.2573726005478;28205.71794282031;29253.122406327846;30089;30493.695063049086;31464.842675786476;48547.51452485571;48732.5126748728;49176.75411622919;49348.50651493583;49372.50627493679;251901;253396;253763;253898;254338;29982.850085750306;33738.156546086546;34183.82908085443;34211.82894085613;34232;40117.59882401139;40779;40838.79580602078;41575.58424415838;41921;34991.475127873615;35089.298214035065;35414;35420;35660.46509302415;33866;34186.65813341835;34456.13859653529;34460.82769586136;37647.24705505929;37000.62999370079;37023.0768086257;37643.247135057696;37743.62256377511;37876.43185352277;32327.676723232467;33094.66905330916;33581;34110.147246319044;34194.82902585471;25339.49321013606;25769.226923192335;25850.741492584835;26202.4759504805;26205.344866378495 06:46:32 INFO - PROCESS | 25557 | |2;jquery.html;362.2212243676096;367.8620517306012;374.32808109443556;376.0992423146566;378.9052736815796;18349.908250458746;18377.908110459444;19044.714329285038;19052;19065.714014289795;18024.909875450638;18507.259709611633;18690.345837895675;18720.719189212174;18730;5451.64564303321;5697.829065128053;5730.398308177644;5734.713264336788;5742.39704830993;4243.405923170759;5711;5962.07587823888;6195.81412557624;6226.657533835637;6154.046122850943;6169.691515424211;6173.197484327031;6188.257409110891;6190.226221722285;5896.764129434818;6077.209962704865;6089.512838972872;6090.23872015998;6095.878082438371;3811.2377524494937;5244.344456942882;5352.277442545245;5494.642848214853;5523.337199536041;21174.788252117436;21931.890340548194;21965.780342196693;22053;22083;2278.225403362848;2342.4963632818854;2411.78293953545;2470.197185914567;2486.080150344366;13580.295997376028;14068.718625627533;14208.715825683532;14225.715485690333;14244.21656808875;1832.7342535332302;1859.3956963986623;1864.2263460663808;1892.981070189308;1917.4631103291101;63595;64461;65246.3475365245;65614.67192664054;66776.3322366775;9491.810163796685;9751.902480975099;9917.107460328605;9968.501574921225;9985.60057597688;14221.64445888861;14249.145051296955;14280.50018249377;14343.426262949366;14355.497557585435;8230.753077407688;8290.792730181673;8316.459430137143;8434.746957591282;8450.746477605559;8392.412531122885;8479.703210387606;8531.317494600416;8570.657173713107;8615.526146062026;5974.9402505974385;5992.161097446361;6005.189299444606;6124.326324104345;6172.321044685081;1587.857092861625;1740.2429942974848;1771.1586996176713;1782.6880295948158;1817.3094224194722;913.456493386434;1059.4755595980039;1072.399456304472;1076.2735153771173;1128.9830652540054;16617;16887.408940687015;17183.956845312372;17302.307907683804;17428.738568921475;990.8166989106894;1015.5785349080197;1040.9115225205792;1045.430240518919;1114.1810769084716;10322.638707645196;10589.15286777056;10649.148068154529;10692.732681683021;10778;332001;333105;338643;345018;444145;69686.303136969;74402;77629;80423.59788201022;81220;497.80585571627097;512.7385033632875;513.7559659161943;517.056372120881;523.5968304405586;10570.682879513626;10677.437415020495;10889.509972051119;10983.890161098287;10987.780244394908;33921.32157356889;34170.82914585411;34354;34835;34957.65042349646;45087.54912450833;48404.75797620989;48683.269750954474;48721.756391217816;49319.50680493293;8272.503649781032;8326.666933322842;8385.329173666214;8387.245147936716;8467.983841939007;11694.356810375511;11888.405579720806;12000.15998880105;12036.157468977088;12117.515299387926;10588.364698118137;10632.734181645521;11097.611583594859;11143.442827858737;11157.832632510681;10426.113780328453;10650.147988160774;10707.57169713234;10736.194785391282;10813.513391897226;10453.372797632166;10742.409167495864;10834.512446940063;10838.458077096271;11209.775804484028;8350.916490835014;8369.204925532065;8452.535110568977;8457.36569757283;8470.407071504935;8340.842699410756;10400.739981500523;10810.459477026274;10916;11029.283096598696 06:46:32 INFO - PROCESS | 25557 | |3;mootools.html;1414;1534.4399294257596;1566.0838409530427;1782.8751987360881;1923.903804809759;7936.4841285316415;8140.592970351481;8154.592270386486;8161.1430799765985;8169.264766171043;7987.480813747103;8135.430519863612;8153.347732181426;8171.91828081719;8189.222023907734;2393.150431596784;2407.831451798375;2413.78275955164;2419.346776370379;2421.6609674645565;2276.8520046197027;2279.418748219202;2314.0975019742314;2316.4093156245135;2336.4392545788974;2371.2412028150998;2398.2325655790155;2398.2325655790155;2404.4589967257316;2416.118116887341;2345.6950596422525;2366.420227044368;2396.7363590005084;2413.9758602413926;2416.7099948006176;2430.368104292879;2464.2360868130936;2471.8146139039463;2478.21936090131;2481.8759062047006;8310.127436619128;8327.750167494985;8339.374546908946;8341.45780524264;8365.28895043922;5061.266116413136;5183.118869792107;5202.583793296527;5204.271402003723;5205.947940520622;3122.2506598416444;3127.6403213630497;3159.873605055795;3226.1934516370907;3258.5926759155104;977.3451787302524;1010.1111022300402;1023.2121266624732;1028.5834237133972;1066.861308029959;11649.650510484698;11685.649430517098;11694.707632309175;11701.531938722526;11711.414429278502;4411.845585404495;4553.590176884097;4556.794944227518;4585.724856508554;4618.95381046192;9798.167155791694;9825.459599722084;9829.754256143511;9863.80272394548;9869;5111.539961403417;5169.172932330809;5169.250458683545;5182.792688292501;5222.399424066205;4087.3868919661695;4602.125596136723;4614.930776038362;4694.718316900997;4699.342092107107;3781.697464202857;3839.1745774658584;3867.7099217558793;3877.282702699953;3929.096307849211;1256.4597223193932;1263.286243272548;1274.4710944957924;1288.4588472841428;1295.229338543565;1311.0691409099645;1317.703516708752;1347.9460821567225;1495.8429364916744;1496.3715239599394;7714.537127772352;7802.648880800378;7885.093214280431;7908.288254057163;7910.446268761131;493.3118299971591;494.34746135101324;494.39930484461553;522.5349438999293;541.6452223793422;6000.189974353407;6001.309849367379;6004.639721616717;6057.515398768088;6062.302835173923;9793.412395256164;10015.849762253572;10046.146077583488;10076.09315161639;10077.294589378673;9543.952280238555;9654.75863103428;9812.116909478182;9832.950835245922;9871.75320616976;7774.883376749353;7895.368370530229;7971.760847174594;7973.880391794128;7978.5611791350875;7623.961880190785;7643.388528917784;7738.535687858746;7741.45809793309;7799.220077992155;9094.863577046483;9215.308851836005;9296.302777291865;9301.906980930104;9486.241100712065;9416.576254068446;9517.333786634868;9684.225261979165;9687.515624218902;9687.612495500101;6320.336364681642;6948.930510694829;7093;7281.308275713799;7393.260673932564;7794.337481314152;7820.374370050268;7854.096778870503;7880.566568838769;7886.842263154819;7159.57042577447;7315.305046020832;7322.707091716272;7364.96317518409;7391.632547978641;6997.1253593300835;7045.436365090883;7153.213146553979;7179.928200718135;7181.820454488679;7333.779986600411;7487.588182650006;7497.212792656693;7505.099388073466;7507.286807753473;6746.966265168643;6750.932490675031;6818.965905170442;6839.760608378683;6845.383915447634;6691.1636045494315;6766.289539598468;6776.6950487227205;6785.423239024541;6787.490938179558 06:46:32 INFO - PROCESS | 25557 | |4;prototype.html;343.9982800086;344.3835534393436;349.6032003675827;350.46204076742174;354.865151242528;5944.22725045744;5975.28296604407;6006.849828754283;6011.879762404749;6032.487238584715;5935.436133567315;5945.970270148654;5948.018576934812;5949.851253718648;5969.044952807551;4421.6683748718815;4520.231560634684;4606.424196975378;4653.488116307203;4678.532146785328;4670;4673.859784206479;4687.062587482517;4693.671442998992;4705.223638099709;4622.930656040162;4643.837465688702;4645.372874661928;4646.233371493699;4657.650676199281;4361.60745532902;4520.028193938303;4572.154151481986;4601.332806743004;4605.217113090783;4116.876493705194;4121.258173528764;4123.134141830219;4124.298869192245;4128.752274863517;5655.886882262373;5663.037283661787;5668.546516278688;5676.517496012844;5677.517411020068;5376.220448035052;5391.975524650304;5394.91907621386;5395.136778115482;5408.91886621701;6288.717007734663;6289.96855015722;6294.150289710876;6297.0554416837385;6298.937010629881;4424.491183513905;4540.79566419512;4546.04533048057;4556.726596404226;4597.95402045982;6477.870442591122;6497.805065848032;6557.409833115043;6558.606483610999;6562.44219241365;4646.674732768742;4649.883752906137;4653.488116307203;4656.231721765938;4661.813527458931;4715.646326525524;4716.151092803259;4720.905581888343;4722.244440889442;4723.0789995951145;5361.678299302054;5371.409144994126;5373.570114390839;5377.247185394048;5379.757910894019;6211.223597050369;6325.462335701425;6343.207099112611;6348.143000694847;6355.110284560165;1649.9752503712455;1655.6440365321273;1661.567992321981;1667.6075476976619;1669.8580620647137;1053.2311412668794;1133.7222380516826;1135.5628083187867;1151.5681619392728;1161.8838116188483;6115.1744514490865;6121.755129794758;6121.938780612226;6128.050152226323;6129.478994285447;6508.284088750233;6514.5114116441455;6523.315051919575;6525.608463492111;6531.902021469682;6098.54260930432;6100.847478813065;6106.847328816815;6118.663473508911;6118.724657390339;3492.860285588548;3515.0140170803415;3546.733994950389;3548.059764162499;3553.040679016651;6618.768343107968;6725.293844146392;6777.932220677829;6831.795046148623;6878.484113691493;6722.327767223336;6734.461243100638;6752.257251702309;6776.93223067763;6786.049953006583;6827.658617069127;6849.623270720059;6853.9314606853295;6856;6860.656967151723;6603.966980165068;6606.273309935807;6608.801735947929;6612.305707900794;6623.039659249478;6275.717592708431;6437.388448097423;6495.805125846232;6497.902531462127;6506.446952008943;6777;6820.795376138723;6823.044773731781;6830.21452532965;6832.521723479309;4577.519360467103;4606.631469482366;4611.538846115362;4613.746243956614;4616.353710480603;6598.571092878948;6607.108040414482;6608.173978252718;6608.867822643617;6619.933800662125;6191.81424557264;6409.807705768834;6414.711337989708;6415.550911436155;6419.903701444388;6310.211223597051;6358.586691865014;6359.236891573041;6419.646919419477;6448.871022579428;6244.750209991731;6246.500279977682;6292.811215663537;6299.937000629935;6301.298649364738;6447.70985305653;6461.901476749058;6464.0627109069865;6477.77327793525;6478.287388387368;6040.516758659384;6150.876982460236;6282.340354262919;6315.400036996478;6319.6840157991 06:46:32 INFO - PROCESS | 25557 | |5;yui.html;702.852400995791;782.624340316648;790.6876783670454;790.9644066017029;822.9753107406776;14281.357338919748;14459.132452052883;14526.055806372604;14544.854551454495;14557;14103.788443173335;14187.574372768808;14198.645033874158;14206.573802785908;14218.217998010105;755.5202446446505;905.1536813079758;920.0339643374464;920.397139873384;922.5341202692631;909.2998391238742;909.6634245329204;913.2237598041678;915.7847905742178;919.384012711485;793.9801504962364;991.1179050644931;991.9752006199831;992.1318846009741;994.0854413939194;983.5918093990986;987.7135630667134;987.9012098790135;989.6437282578266;990.2622546203053;726.0778810910115;728.4099879097947;729.1833146875481;730.8684436801374;731.6780616528764;14051.78922316166;14061.086029408056;14070.507532236425;14080.577582672537;14126.92936535321;13447.3948672309;13479;13566.796498052538;13999.720005599933;14325.498607548685;10393.584256629802;10572.207084468695;10642.414667193301;10704.946475267652;10912.727181820439;3613.819309034564;3629.114853691295;3706.703463722896;3710.666040056408;3750.2124553843723;51123.74438127823;51368.486315136746;51671;51680;51807;9765.267604929659;9877.604895804086;9996.3002589818;10130.442825644514;10145.731783527059;19674.213031478866;19681.40955771329;19705.310314138937;19710.70433943492;19721.60556788856;7755.573443460664;7932.762017139495;8265.049519305237;8297.502149871027;8377.83244335122;4532.1842068427995;4542.1824071667415;4622.699524530894;4639.280911458729;4715.811367545329;3356.429407000816;3375.071855239829;3380.4253276942486;3385.170633194834;3385.932281354359;570.3925319534683;584.6696616411799;593.5844908564022;594;601.8886505996404;605.12257227021;669.9062131301622;685.2564967010849;698.6751160710294;709.0321710864632;8659.913400866037;8817.426867253607;8898.288136949028;8943.105689431004;8957.283417326598;658.4777776127465;672.1900110366996;679.6941376380648;681.7852376501386;689.7827184436986;3910.608939106067;3916.921661566753;3921.1961547882615;3947.585503522089;4032.9395059074136;59039.70480147572;59438.40561594415;60117.69941150266;60139.39860601338;60139.398606014256;48490.5150948486;50953.490465095616;51747.74126129345;52211.73894130505;52504.47495525072;43718.344224836655;43962.56037439649;44530.55469445329;47465.76267118642;47889.76055119702;7845.686172553034;8222.753317400488;8284.25441710249;8419.031811341774;8658.134186581543;34028.31943361169;34300.656993429744;35225.82387088048;35729.46405803863;37084.6291537092;42202.577974219865;42286.57713422826;43040.35439468473;43717.562824372624;43806.34290485709;10658.680239592824;10848.511816968097;10950.34297942126;11036.613718519813;11077.390743509184;11923.344216068199;12176.147669663393;12193.69515762113;12369;12552.246865188117;11539.307641541534;11637.359945203096;11662.300261984308;11703.590374336858;11901.583444579399;10635.14918806509;11113.222074455034;11587.130965177477;11641.941790290994;11866.881331186923;11312.434378281218;11364.94317528407;11422.94288528552;11670.70823229426;11695.181337306647;9456.763580910532;9541.379810312585;9617.086376794474;9619.134277915022;9891.35706179096;9807.558659860466;9910.801783964136;9978;9992;9998.700038998843 06:46:32 INFO - PROCESS | 25557 | __end_tp_report 06:46:32 INFO - PROCESS | 25557 | __start_cc_report 06:46:32 INFO - PROCESS | 25557 | _x_x_mozilla_cycle_collect,905 06:46:32 INFO - PROCESS | 25557 | __end_cc_report 06:46:32 INFO - PROCESS | 25557 | __startTimestamp1465220792412__endTimestamp 06:46:32 INFO - PROCESS | 25557 | 06:46:32 INFO - PROCESS | 25557 | ------- Summary: start ------- 06:46:32 INFO - PROCESS | 25557 | Number of tests: 6 06:46:32 INFO - PROCESS | 25557 | 06:46:32 INFO - PROCESS | 25557 | [#0] dojo.html Cycles:165 Average:5352.50 Median:5585.72 stddev:584.43 (10.5%) stddev-sans-first:563.21 06:46:32 INFO - PROCESS | 25557 | Values: 3282.2 3336.8 3361.0 3361.4 3382.5 5330.8 5372.1 5373.6 5389.2 5393.3 5362.2 5368.5 5391.1 5410.5 5419.8 4843.2 4869.4 4916.3 4948.7 5023.6 4846.7 4858.9 4919.9 4948.8 4970.2 4917.9 4941.5 4952.2 4963.1 4974.4 4752.5 4889.0 4906.2 4932.4 4941.9 4774.3 4815.4 4835.4 4858.4 4864.7 5190.5 5248.8 5274.7 5326.9 5331.1 5618.9 5711.7 5716.8 5780.1 5799.4 5710.9 5728.0 5745.7 5758.8 5777.5 5298.2 5324.7 5332.0 5354.0 5360.0 5678.3 5738.7 5820.3 5840.8 5847.2 5716.4 5718.8 5719.7 5729.5 5738.9 5754.2 5771.7 5806.3 5836.4 5843.9 5635.6 5745.0 5767.2 5800.8 5824.8 5573.8 5575.7 5578.3 5585.7 5602.2 4265.2 4288.2 4289.4 4290.7 4294.3 3906.6 3950.1 3991.3 3993.1 4019.7 5475.2 5479.1 5497.7 5506.4 5537.0 5719.7 5797.6 5815.8 5816.2 5816.3 5504.8 5525.7 5561.9 5579.2 5602.9 4907.2 4908.0 4910.3 4911.7 4946.8 5857.3 5864.3 5871.4 5906.2 5907.2 5729.3 5754.1 5772.2 5772.4 5779.9 5876.6 5918.4 5928.2 5931.8 5944.9 5536.1 5587.9 5672.0 5701.3 5766.9 5824.3 5836.3 5841.3 5844.4 5847.0 5629.8 5669.6 5671.3 5678.5 5684.2 5529.9 5626.1 5649.3 5679.4 5721.1 5586.2 5612.1 5629.3 5630.5 5640.6 5715.8 5747.7 5749.5 5761.1 5762.1 5453.8 5532.3 5545.8 5610.3 5627.4 06:46:32 INFO - PROCESS | 25557 | 06:46:32 INFO - PROCESS | 25557 | [#1] ext.html Cycles:180 Average:49433.70 Median:37695.43 stddev:87676.21 (232.6%) stddev-sans-first:87845.32 06:46:32 INFO - PROCESS | 25557 | Values: 541.5 544.3 547.5 548.8 567.4 31654.5 40100.4 40401.6 40402.0 40782.8 43301.8 43709.8 43817.8 43935.6 44025.0 8910.0 9123.1 9133.6 9133.9 9135.0 8925.0 9058.3 9069.6 9077.6 9081.4 9239.1 9309.6 9320.3 9330.3 9332.5 9184.3 9270.7 9279.0 9290.8 9291.7 9177.1 9313.2 9322.5 9328.5 9330.4 44036.8 44488.1 44548.8 44616.3 44640.6 3450.2 3481.2 3618.3 4086.1 4235.4 32991.0 33286.7 33793.5 34108.5 34347.0 4066.6 4122.9 4138.1 4150.8 4199.5 303107.0 303552.0 304311.0 304480.0 304974.0 46556.3 47295.5 65975.7 66961.7 67019.3 45565.5 45589.0 45868.3 45873.3 45882.5 16094.7 16232.5 16243.8 16244.4 16281.2 13839.1 13912.0 13914.4 13956.8 13995.8 15745.2 15877.4 15895.0 15900.3 15903.2 5779.0 5834.4 5850.9 5967.0 6011.3 990.5 1026.9 1040.6 1178.5 1205.2 29793.3 30137.2 30454.2 30738.0 30990.2 1031.8 1096.4 1132.4 1161.1 1292.6 14730.4 15017.5 15592.8 15711.7 15712.9 416002.0 419143.0 419900.0 422002.0 423310.0 60297.4 60769.4 60867.4 60994.0 61133.0 1325.8 1401.6 1450.7 1474.5 1500.3 28205.7 29253.1 30089.0 30493.7 31464.8 48547.5 48732.5 49176.8 49348.5 49372.5 251901.0 253396.0 253763.0 253898.0 254338.0 29982.9 33738.2 34183.8 34211.8 34232.0 40117.6 40779.0 40838.8 41575.6 41921.0 34991.5 35089.3 35414.0 35420.0 35660.5 33866.0 34186.7 34456.1 34460.8 37647.2 37000.6 37023.1 37643.2 37743.6 37876.4 32327.7 33094.7 33581.0 34110.1 34194.8 25339.5 25769.2 25850.7 26202.5 26205.3 06:46:32 INFO - PROCESS | 25557 | 06:46:32 INFO - PROCESS | 25557 | [#2] jquery.html Cycles:180 Average:23631.22 Median:34046.08 stddev:59622.11 (175.1%) stddev-sans-first:59763.77 06:46:32 INFO - PROCESS | 25557 | Values: 362.2 367.9 374.3 376.1 378.9 18349.9 18377.9 19044.7 19052.0 19065.7 18024.9 18507.3 18690.3 18720.7 18730.0 5451.6 5697.8 5730.4 5734.7 5742.4 4243.4 5711.0 5962.1 6195.8 6226.7 6154.0 6169.7 6173.2 6188.3 6190.2 5896.8 6077.2 6089.5 6090.2 6095.9 3811.2 5244.3 5352.3 5494.6 5523.3 21174.8 21931.9 21965.8 22053.0 22083.0 2278.2 2342.5 2411.8 2470.2 2486.1 13580.3 14068.7 14208.7 14225.7 14244.2 1832.7 1859.4 1864.2 1893.0 1917.5 63595.0 64461.0 65246.3 65614.7 66776.3 9491.8 9751.9 9917.1 9968.5 9985.6 14221.6 14249.1 14280.5 14343.4 14355.5 8230.8 8290.8 8316.5 8434.7 8450.7 8392.4 8479.7 8531.3 8570.7 8615.5 5974.9 5992.2 6005.2 6124.3 6172.3 1587.9 1740.2 1771.2 1782.7 1817.3 913.5 1059.5 1072.4 1076.3 1129.0 16617.0 16887.4 17184.0 17302.3 17428.7 990.8 1015.6 1040.9 1045.4 1114.2 10322.6 10589.2 10649.1 10692.7 10778.0 332001.0 333105.0 338643.0 345018.0 444145.0 69686.3 74402.0 77629.0 80423.6 81220.0 497.8 512.7 513.8 517.1 523.6 10570.7 10677.4 10889.5 10983.9 10987.8 33921.3 34170.8 34354.0 34835.0 34957.7 45087.5 48404.8 48683.3 48721.8 49319.5 8272.5 8326.7 8385.3 8387.2 8468.0 11694.4 11888.4 12000.2 12036.2 12117.5 10588.4 10632.7 11097.6 11143.4 11157.8 10426.1 10650.1 10707.6 10736.2 10813.5 10453.4 10742.4 10834.5 10838.5 11209.8 8350.9 8369.2 8452.5 8457.4 8470.4 8340.8 10400.7 10810.5 10916.0 11029.3 06:46:32 INFO - PROCESS | 25557 | 06:46:32 INFO - PROCESS | 25557 | [#3] mootools.html Cycles:180 Average:5800.10 Median:6031.08 stddev:3061.77 (50.8%) stddev-sans-first:3052.60 06:46:32 INFO - PROCESS | 25557 | Values: 1414.0 1534.4 1566.1 1782.9 1923.9 7936.5 8140.6 8154.6 8161.1 8169.3 7987.5 8135.4 8153.3 8171.9 8189.2 2393.2 2407.8 2413.8 2419.3 2421.7 2276.9 2279.4 2314.1 2316.4 2336.4 2371.2 2398.2 2398.2 2404.5 2416.1 2345.7 2366.4 2396.7 2414.0 2416.7 2430.4 2464.2 2471.8 2478.2 2481.9 8310.1 8327.8 8339.4 8341.5 8365.3 5061.3 5183.1 5202.6 5204.3 5205.9 3122.3 3127.6 3159.9 3226.2 3258.6 977.3 1010.1 1023.2 1028.6 1066.9 11649.7 11685.6 11694.7 11701.5 11711.4 4411.8 4553.6 4556.8 4585.7 4619.0 9798.2 9825.5 9829.8 9863.8 9869.0 5111.5 5169.2 5169.3 5182.8 5222.4 4087.4 4602.1 4614.9 4694.7 4699.3 3781.7 3839.2 3867.7 3877.3 3929.1 1256.5 1263.3 1274.5 1288.5 1295.2 1311.1 1317.7 1347.9 1495.8 1496.4 7714.5 7802.6 7885.1 7908.3 7910.4 493.3 494.3 494.4 522.5 541.6 6000.2 6001.3 6004.6 6057.5 6062.3 9793.4 10015.8 10046.1 10076.1 10077.3 9544.0 9654.8 9812.1 9833.0 9871.8 7774.9 7895.4 7971.8 7973.9 7978.6 7624.0 7643.4 7738.5 7741.5 7799.2 9094.9 9215.3 9296.3 9301.9 9486.2 9416.6 9517.3 9684.2 9687.5 9687.6 6320.3 6948.9 7093.0 7281.3 7393.3 7794.3 7820.4 7854.1 7880.6 7886.8 7159.6 7315.3 7322.7 7365.0 7391.6 6997.1 7045.4 7153.2 7179.9 7181.8 7333.8 7487.6 7497.2 7505.1 7507.3 6747.0 6750.9 6819.0 6839.8 6845.4 6691.2 6766.3 6776.7 6785.4 6787.5 06:46:32 INFO - PROCESS | 25557 | 06:46:32 INFO - PROCESS | 25557 | [#4] prototype.html Cycles:180 Average:5349.32 Median:6069.53 stddev:1585.58 (26.1%) stddev-sans-first:1544.88 06:46:32 INFO - PROCESS | 25557 | Values: 344.0 344.4 349.6 350.5 354.9 5944.2 5975.3 6006.8 6011.9 6032.5 5935.4 5946.0 5948.0 5949.9 5969.0 4421.7 4520.2 4606.4 4653.5 4678.5 4670.0 4673.9 4687.1 4693.7 4705.2 4622.9 4643.8 4645.4 4646.2 4657.7 4361.6 4520.0 4572.2 4601.3 4605.2 4116.9 4121.3 4123.1 4124.3 4128.8 5655.9 5663.0 5668.5 5676.5 5677.5 5376.2 5392.0 5394.9 5395.1 5408.9 6288.7 6290.0 6294.2 6297.1 6298.9 4424.5 4540.8 4546.0 4556.7 4598.0 6477.9 6497.8 6557.4 6558.6 6562.4 4646.7 4649.9 4653.5 4656.2 4661.8 4715.6 4716.2 4720.9 4722.2 4723.1 5361.7 5371.4 5373.6 5377.2 5379.8 6211.2 6325.5 6343.2 6348.1 6355.1 1650.0 1655.6 1661.6 1667.6 1669.9 1053.2 1133.7 1135.6 1151.6 1161.9 6115.2 6121.8 6121.9 6128.1 6129.5 6508.3 6514.5 6523.3 6525.6 6531.9 6098.5 6100.8 6106.8 6118.7 6118.7 3492.9 3515.0 3546.7 3548.1 3553.0 6618.8 6725.3 6777.9 6831.8 6878.5 6722.3 6734.5 6752.3 6776.9 6786.0 6827.7 6849.6 6853.9 6856.0 6860.7 6604.0 6606.3 6608.8 6612.3 6623.0 6275.7 6437.4 6495.8 6497.9 6506.4 6777.0 6820.8 6823.0 6830.2 6832.5 4577.5 4606.6 4611.5 4613.7 4616.4 6598.6 6607.1 6608.2 6608.9 6619.9 6191.8 6409.8 6414.7 6415.6 6419.9 6310.2 6358.6 6359.2 6419.6 6448.9 6244.8 6246.5 6292.8 6299.9 6301.3 6447.7 6461.9 6464.1 6477.8 6478.3 6040.5 6150.9 6282.3 6315.4 6319.7 06:46:32 INFO - PROCESS | 25557 | 06:46:32 INFO - PROCESS | 25557 | [#5] yui.html Cycles:180 Average:14123.53 Median:47677.76 stddev:16185.77 (33.9%) stddev-sans-first:16199.79 06:46:32 INFO - PROCESS | 25557 | Values: 702.9 782.6 790.7 791.0 823.0 14281.4 14459.1 14526.1 14544.9 14557.0 14103.8 14187.6 14198.6 14206.6 14218.2 755.5 905.2 920.0 920.4 922.5 909.3 909.7 913.2 915.8 919.4 794.0 991.1 992.0 992.1 994.1 983.6 987.7 987.9 989.6 990.3 726.1 728.4 729.2 730.9 731.7 14051.8 14061.1 14070.5 14080.6 14126.9 13447.4 13479.0 13566.8 13999.7 14325.5 10393.6 10572.2 10642.4 10704.9 10912.7 3613.8 3629.1 3706.7 3710.7 3750.2 51123.7 51368.5 51671.0 51680.0 51807.0 9765.3 9877.6 9996.3 10130.4 10145.7 19674.2 19681.4 19705.3 19710.7 19721.6 7755.6 7932.8 8265.0 8297.5 8377.8 4532.2 4542.2 4622.7 4639.3 4715.8 3356.4 3375.1 3380.4 3385.2 3385.9 570.4 584.7 593.6 594.0 601.9 605.1 669.9 685.3 698.7 709.0 8659.9 8817.4 8898.3 8943.1 8957.3 658.5 672.2 679.7 681.8 689.8 3910.6 3916.9 3921.2 3947.6 4032.9 59039.7 59438.4 60117.7 60139.4 60139.4 48490.5 50953.5 51747.7 52211.7 52504.5 43718.3 43962.6 44530.6 47465.8 47889.8 7845.7 8222.8 8284.3 8419.0 8658.1 34028.3 34300.7 35225.8 35729.5 37084.6 42202.6 42286.6 43040.4 43717.6 43806.3 10658.7 10848.5 10950.3 11036.6 11077.4 11923.3 12176.1 12193.7 12369.0 12552.2 11539.3 11637.4 11662.3 11703.6 11901.6 10635.1 11113.2 11587.1 11641.9 11866.9 11312.4 11364.9 11422.9 11670.7 11695.2 9456.8 9541.4 9617.1 9619.1 9891.4 9807.6 9910.8 9978.0 9992.0 9998.7 06:46:32 INFO - PROCESS | 25557 | -------- Summary: end -------- 06:46:32 INFO - PROCESS | 25557 | 06:46:33 INFO - TEST-INFO | 25557: exit 0 06:46:33 INFO - TEST-OK | dromaeo_css | took 1110835ms 06:46:33 INFO - TEST-START | kraken 06:46:33 INFO - operating with platform_type : linux_ 06:46:33 INFO - Initialising browser for kraken test... 06:46:33 INFO - TEST-INFO | started process 25754 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpQZTVvd/profile http://localhost:55000/getInfo.html) 06:46:37 INFO - PROCESS | 25754 | __metrics Screen width/height:1600/1200 06:46:37 INFO - PROCESS | 25754 | colorDepth:24 06:46:37 INFO - PROCESS | 25754 | Browser inner width/height: 1024/697 06:46:37 INFO - PROCESS | 25754 | __metrics 06:46:37 INFO - PROCESS | 25754 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 06:46:38 INFO - TEST-INFO | 25754: exit 0 06:46:38 INFO - Browser initialized. 06:46:38 INFO - Running cycle 1/1 for kraken test... 06:46:38 INFO - TEST-INFO | started process 25843 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpQZTVvd/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:46:50 INFO - PROCESS | 25843 | RSS: Main: 138997760 06:46:50 INFO - PROCESS | 25843 | 06:46:53 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55000/tests/kraken/driver.html?testName=audio-beat-detection) 06:46:53 INFO - PROCESS | 25843 | RSS: Main: 183037952 06:46:53 INFO - PROCESS | 25843 | 06:46:56 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55000/tests/kraken/driver.html?testName=audio-dft) 06:46:56 INFO - PROCESS | 25843 | RSS: Main: 175304704 06:46:56 INFO - PROCESS | 25843 | 06:46:59 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55000/tests/kraken/driver.html?testName=audio-fft) 06:47:00 INFO - PROCESS | 25843 | RSS: Main: 174968832 06:47:00 INFO - PROCESS | 25843 | 06:47:02 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55000/tests/kraken/driver.html?testName=audio-oscillator) 06:47:02 INFO - PROCESS | 25843 | RSS: Main: 175878144 06:47:02 INFO - PROCESS | 25843 | 06:47:05 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55000/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:47:05 INFO - PROCESS | 25843 | RSS: Main: 174055424 06:47:05 INFO - PROCESS | 25843 | 06:47:08 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55000/tests/kraken/driver.html?testName=imaging-darkroom) 06:47:09 INFO - PROCESS | 25843 | RSS: Main: 174186496 06:47:09 INFO - PROCESS | 25843 | 06:47:12 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55000/tests/kraken/driver.html?testName=imaging-desaturate) 06:47:13 INFO - PROCESS | 25843 | RSS: Main: 174743552 06:47:13 INFO - PROCESS | 25843 | 06:47:15 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55000/tests/kraken/driver.html?testName=json-parse-financial) 06:47:16 INFO - PROCESS | 25843 | RSS: Main: 174350336 06:47:16 INFO - PROCESS | 25843 | 06:47:18 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55000/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:47:18 INFO - PROCESS | 25843 | RSS: Main: 182009856 06:47:18 INFO - PROCESS | 25843 | 06:47:20 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55000/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:47:21 INFO - PROCESS | 25843 | RSS: Main: 181522432 06:47:21 INFO - PROCESS | 25843 | 06:47:23 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55000/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:47:23 INFO - PROCESS | 25843 | RSS: Main: 185253888 06:47:23 INFO - PROCESS | 25843 | 06:47:25 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55000/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:47:26 INFO - PROCESS | 25843 | RSS: Main: 187883520 06:47:26 INFO - PROCESS | 25843 | 06:47:29 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55000/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:47:29 INFO - PROCESS | 25843 | RSS: Main: 185589760 06:47:29 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | Cycle 1(1): loaded http://localhost:55000/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55000/tests/kraken/driver.html?testName=ai-astar) 06:47:31 INFO - PROCESS | 25843 | RSS: Main: 247820288 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | __start_tp_report 06:47:31 INFO - PROCESS | 25843 | _x_x_mozilla_page_load 06:47:31 INFO - PROCESS | 25843 | _x_x_mozilla_page_load_details 06:47:31 INFO - PROCESS | 25843 | |i|pagename|runs| 06:47:31 INFO - PROCESS | 25843 | |0;ai-astar;111;112;114;113;111;113;112;111;111;123 06:47:31 INFO - PROCESS | 25843 | |1;audio-beat-detection;162;128;153;187;129;159;149;130;169;129 06:47:31 INFO - PROCESS | 25843 | |2;audio-dft;162;162;162;161;161;162;168;160;163;161 06:47:31 INFO - PROCESS | 25843 | |3;audio-fft;77;77;76;156;76;75;77;80;173;74 06:47:31 INFO - PROCESS | 25843 | |4;audio-oscillator;94;94;157;93;93;94;144;93;93;136 06:47:31 INFO - PROCESS | 25843 | |5;imaging-gaussian-blur;118;117;117;117;117;116;117;117;117;116 06:47:31 INFO - PROCESS | 25843 | |6;imaging-darkroom;147;146;145;146;146;146;145;147;145;146 06:47:31 INFO - PROCESS | 25843 | |7;imaging-desaturate;95;95;96;96;96;95;95;95;96;95 06:47:31 INFO - PROCESS | 25843 | |8;json-parse-financial;52;57;56;55;54;55;55;54;65;53 06:47:31 INFO - PROCESS | 25843 | |9;json-stringify-tinderbox;65;65;72;66;65;65;66;66;66;66 06:47:31 INFO - PROCESS | 25843 | |10;stanford-crypto-aes;80;81;80;81;81;88;80;80;82;87 06:47:31 INFO - PROCESS | 25843 | |11;stanford-crypto-ccm;126;117;116;113;114;115;118;115;115;118 06:47:31 INFO - PROCESS | 25843 | |12;stanford-crypto-pbkdf2;150;138;148;152;141;137;142;146;148;148 06:47:31 INFO - PROCESS | 25843 | |13;stanford-crypto-sha256-iterative;73;69;69;70;67;67;68;70;67;66 06:47:31 INFO - PROCESS | 25843 | __end_tp_report 06:47:31 INFO - PROCESS | 25843 | __start_cc_report 06:47:31 INFO - PROCESS | 25843 | _x_x_mozilla_cycle_collect,1035 06:47:31 INFO - PROCESS | 25843 | __end_cc_report 06:47:31 INFO - PROCESS | 25843 | __startTimestamp1465220851626__endTimestamp 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | ------- Summary: start ------- 06:47:31 INFO - PROCESS | 25843 | Number of tests: 14 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#0] ai-astar Cycles:10 Average:113.10 Median:112.50 stddev:3.63 (3.2%) stddev-sans-first:3.77 06:47:31 INFO - PROCESS | 25843 | Values: 111.0 112.0 114.0 113.0 111.0 113.0 112.0 111.0 111.0 123.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#1] audio-beat-detection Cycles:10 Average:149.50 Median:156.00 stddev:20.35 (13.0%) stddev-sans-first:21.08 06:47:31 INFO - PROCESS | 25843 | Values: 162.0 128.0 153.0 187.0 129.0 159.0 149.0 130.0 169.0 129.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#2] audio-dft Cycles:10 Average:162.20 Median:162.00 stddev:2.20 (1.4%) stddev-sans-first:2.33 06:47:31 INFO - PROCESS | 25843 | Values: 162.0 162.0 162.0 161.0 161.0 162.0 168.0 160.0 163.0 161.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#3] audio-fft Cycles:10 Average:94.10 Median:76.50 stddev:37.35 (48.8%) stddev-sans-first:39.10 06:47:31 INFO - PROCESS | 25843 | Values: 77.0 77.0 76.0 156.0 76.0 75.0 77.0 80.0 173.0 74.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#4] audio-oscillator Cycles:10 Average:109.10 Median:93.00 stddev:25.73 (27.7%) stddev-sans-first:26.70 06:47:31 INFO - PROCESS | 25843 | Values: 94.0 94.0 157.0 93.0 93.0 94.0 144.0 93.0 93.0 136.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#5] imaging-gaussian-blur Cycles:10 Average:116.90 Median:117.00 stddev:0.57 (0.5%) stddev-sans-first:0.44 06:47:31 INFO - PROCESS | 25843 | Values: 118.0 117.0 117.0 117.0 117.0 116.0 117.0 117.0 117.0 116.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#6] imaging-darkroom Cycles:10 Average:145.90 Median:146.00 stddev:0.74 (0.5%) stddev-sans-first:0.67 06:47:31 INFO - PROCESS | 25843 | Values: 147.0 146.0 145.0 146.0 146.0 146.0 145.0 147.0 145.0 146.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#7] imaging-desaturate Cycles:10 Average:95.40 Median:95.50 stddev:0.52 (0.5%) stddev-sans-first:0.53 06:47:31 INFO - PROCESS | 25843 | Values: 95.0 95.0 96.0 96.0 96.0 95.0 95.0 95.0 96.0 95.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#8] json-parse-financial Cycles:10 Average:55.60 Median:55.00 stddev:3.60 (6.5%) stddev-sans-first:3.57 06:47:31 INFO - PROCESS | 25843 | Values: 52.0 57.0 56.0 55.0 54.0 55.0 55.0 54.0 65.0 53.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#9] json-stringify-tinderbox Cycles:10 Average:66.20 Median:66.00 stddev:2.10 (3.2%) stddev-sans-first:2.18 06:47:31 INFO - PROCESS | 25843 | Values: 65.0 65.0 72.0 66.0 65.0 65.0 66.0 66.0 66.0 66.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#10] stanford-crypto-aes Cycles:10 Average:82.00 Median:81.00 stddev:2.98 (3.7%) stddev-sans-first:3.07 06:47:31 INFO - PROCESS | 25843 | Values: 80.0 81.0 80.0 81.0 81.0 88.0 80.0 80.0 82.0 87.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#11] stanford-crypto-ccm Cycles:10 Average:116.70 Median:116.50 stddev:3.65 (3.1%) stddev-sans-first:1.73 06:47:31 INFO - PROCESS | 25843 | Values: 126.0 117.0 116.0 113.0 114.0 115.0 118.0 115.0 115.0 118.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:145.00 Median:148.00 stddev:5.16 (3.5%) stddev-sans-first:5.15 06:47:31 INFO - PROCESS | 25843 | Values: 150.0 138.0 148.0 152.0 141.0 137.0 142.0 146.0 148.0 148.0 06:47:31 INFO - PROCESS | 25843 | 06:47:31 INFO - PROCESS | 25843 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.60 Median:69.00 stddev:2.07 (3.0%) stddev-sans-first:1.45 06:47:31 INFO - PROCESS | 25843 | Values: 73.0 69.0 69.0 70.0 67.0 67.0 68.0 70.0 67.0 66.0 06:47:31 INFO - PROCESS | 25843 | -------- Summary: end -------- 06:47:31 INFO - PROCESS | 25843 | 06:47:32 INFO - TEST-INFO | 25843: exit 0 06:47:32 INFO - TEST-OK | kraken | took 59455ms 06:47:32 INFO - SUITE-END | took 1170s 06:47:32 INFO - Completed test suite (00:19:30) 06:47:32 INFO - javascript benchmark 06:47:32 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3282.2122690554265, 3336.7831090979084, 3361.0, 3361.411752943234, 3382.5264462975188, 5330.827218012036, 5372.113601255793, 5373.596980226479, 5389.191621256813, 5393.325834270716, 5362.24928510008, 5368.516833484986, 5391.083515802313, 5410.513053825155, 5419.810306639269, 4843.225083986563, 4869.366982292297, 4916.262560615918, 4948.7278199699, 5023.598112151019, 4846.660733748621, 4858.854234372974, 4919.852404427855, 4948.777305021283, 4970.179920313144, 4917.877053073666, 4941.4811444798315, 4952.158133117361, 4963.057019166365, 4974.37820272466, 4752.477227504972, 4888.975555122237, 4906.239532872411, 4932.408111026682, 4941.85174444769, 4774.28385742138, 4815.374001379833, 4835.419749630032, 4858.368412106403, 4864.683795553277, 5190.532852043297, 5248.816291429782, 5274.736263186825, 5326.893462130774, 5331.1470164773455, 5618.904313658838, 5711.742971566289, 5716.771329146829, 5780.075187969905, 5799.39106393831, 5710.942890571083, 5727.971360143214, 5745.6552606843725, 5758.769649214027, 5777.537796976232, 5298.231756395301, 5324.653897496689, 5331.973340133274, 5354.0, 5360.0, 5678.261825962599, 5738.713064346766, 5820.330661973927, 5840.83183363329, 5847.210626565445, 5716.399778023331, 5718.828435146952, 5719.685417302088, 5729.4843464088435, 5738.885222295531, 5754.1944127822135, 5771.740271687784, 5806.274215723035, 5836.416358364129, 5843.883122337529, 5635.605507614509, 5745.0, 5767.22142510764, 5800.83983203361, 5824.767009319579, 5573.7770489179975, 5575.665460072409, 5578.30271216098, 5585.720713964285, 5602.159676048625, 4265.168292182994, 4288.1638080573985, 4289.420928174719, 4290.742555446684, 4294.334378171388, 3906.5507466641134, 3950.071733142709, 3991.3015222336558, 3993.101552150743, 4019.718619696593, 5475.233467314579, 5479.123340265538, 5497.670139791545, 5506.449355064461, 5537.031019571639, 5719.742611582489, 5797.565182611321, 5815.796447124415, 5816.2148110005455, 5816.331121920949, 5504.834854954358, 5525.696086715269, 5561.888762224814, 5579.191017302468, 5602.915956260659, 4907.214845624683, 4907.950920490749, 4910.337104490919, 4911.68074075184, 4946.802127914843, 5857.26784151981, 5864.296284445809, 5871.3541510433815, 5906.232189815297, 5907.172995780594, 5729.255196824386, 5754.079347304411, 5772.191893135048, 5772.365039845529, 5779.913301300568, 5876.559258055578, 5918.408159184047, 5928.170056192223, 5931.822045338647, 5944.940550594439, 5536.141898005815, 5587.860303492445, 5672.0, 5701.315842098975, 5766.8846623066465, 5824.330202026821, 5836.299644042742, 5841.32824725162, 5844.444777746107, 5847.035239185487, 5629.831105066854, 5669.574781891292, 5671.291088613923, 5678.4605462480995, 5684.204211410323, 5529.917051244315, 5626.099824028136, 5649.293838270216, 5679.432056794288, 5721.113227449752, 5586.16207568868, 5612.102063669793, 5629.268195134607, 5630.549556035589, 5640.633358831663, 5715.771369145354, 5747.712614369349, 5749.54003679713, 5761.078227483583, 5762.1068734346245, 5453.836384908459, 5532.253145825262, 5545.750441230073, 5610.270664813711, 5627.43725627434], "unit": "score", "name": "dojo.html", "value": 5315.593993711889}, {"lowerIsBetter": false, "replicates": [541.4909984614462, 544.3467838593689, 547.4798941006044, 548.7667741209988, 567.3503838105366, 31654.52518212226, 40100.39849402258, 40401.595984040185, 40402.0, 40782.79608601953, 43301.783491082504, 43709.7814510927, 43817.78091109548, 43935.56064439355, 44025.0, 8910.0, 9123.133302336268, 9133.634654613808, 9133.862992055092, 9134.954325228364, 8924.955375223115, 9058.27533797298, 9069.637214511444, 9077.591508382138, 9081.364304498687, 9239.122283383067, 9309.627614895397, 9320.347575669706, 9330.346875718702, 9332.48671323077, 9184.311176661744, 9270.72187834366, 9279.0, 9290.814183716355, 9291.674791382304, 9177.128172823572, 9313.161815436642, 9322.533873306307, 9328.533573321307, 9330.393524420891, 44036.779816100716, 44488.11023779539, 44548.77725611351, 44616.3307550387, 44640.55359446396, 3450.2236996675797, 3481.1993241554583, 3618.258257057323, 4086.1010577672864, 4235.449391579075, 32991.0, 33286.66713332884, 33793.493097603554, 34108.48837267443, 34347.0, 4066.593340665939, 4122.855700050483, 4138.0689344897155, 4150.813213405404, 4199.454070970754, 303107.0, 303552.0, 304310.9999999978, 304480.0, 304974.0, 46556.301655475196, 47295.5270447298, 65975.67012165005, 66961.66519167373, 67019.32980670131, 45565.544344556794, 45589.0, 45868.31197531973, 45873.311900321525, 45882.54117458849, 16094.678106437806, 16232.513024609281, 16243.837561624232, 16244.431444899372, 16281.185940702917, 13839.100458470168, 13912.0, 13914.443422262995, 13956.790648140286, 13995.790063149061, 15745.212739362985, 15877.364905403654, 15895.0, 15900.284487198103, 15903.204839757966, 5779.0, 5834.445727655866, 5850.912236316459, 5967.030879809652, 6011.27864656244, 990.5245482168456, 1026.9024442677933, 1040.5785656809005, 1178.5344788808545, 1205.2346759807585, 29793.255168620526, 30137.246568835955, 30454.238644034078, 30738.0, 30990.22524436907, 1031.7936412717486, 1096.3641088169002, 1132.394169119517, 1161.1233518693332, 1292.6445227562494, 14730.410783568752, 15017.549473515812, 15592.766108508382, 15711.68576628461, 15712.92143539275, 416002.0, 419143.0, 419900.0, 422002.0, 423310.0, 60297.397026029175, 60769.39230607637, 60867.39132608706, 60994.0, 61133.0, 1325.7812460943837, 1401.5935378740255, 1450.7461194290956, 1474.5207807462618, 1500.2573726005478, 28205.71794282031, 29253.122406327846, 30089.0, 30493.695063049086, 31464.842675786476, 48547.51452485571, 48732.5126748728, 49176.75411622919, 49348.50651493583, 49372.50627493679, 251901.0, 253396.0, 253763.0, 253898.0, 254338.0, 29982.850085750306, 33738.156546086546, 34183.82908085443, 34211.82894085613, 34232.0, 40117.59882401139, 40779.0, 40838.79580602078, 41575.58424415838, 41921.0, 34991.475127873615, 35089.298214035065, 35414.0, 35420.0, 35660.46509302415, 33866.0, 34186.65813341835, 34456.13859653529, 34460.82769586136, 37647.24705505929, 37000.62999370079, 37023.0768086257, 37643.247135057696, 37743.62256377511, 37876.43185352277, 32327.676723232467, 33094.66905330916, 33581.0, 34110.147246319044, 34194.82902585471, 25339.49321013606, 25769.226923192335, 25850.741492584835, 26202.4759504805, 26205.344866378495], "unit": "score", "name": "ext.html", "value": 18992.94063206998}, {"lowerIsBetter": false, "replicates": [362.2212243676096, 367.8620517306012, 374.32808109443556, 376.0992423146566, 378.9052736815796, 18349.908250458746, 18377.908110459444, 19044.714329285038, 19052.0, 19065.714014289795, 18024.909875450638, 18507.259709611633, 18690.345837895675, 18720.719189212174, 18730.0, 5451.64564303321, 5697.829065128053, 5730.398308177644, 5734.713264336788, 5742.39704830993, 4243.405923170759, 5711.0, 5962.07587823888, 6195.81412557624, 6226.657533835637, 6154.046122850943, 6169.691515424211, 6173.197484327031, 6188.257409110891, 6190.226221722285, 5896.764129434818, 6077.209962704865, 6089.512838972872, 6090.23872015998, 6095.878082438371, 3811.2377524494937, 5244.344456942882, 5352.277442545245, 5494.642848214853, 5523.337199536041, 21174.788252117436, 21931.890340548194, 21965.780342196693, 22053.0, 22083.0, 2278.225403362848, 2342.4963632818854, 2411.78293953545, 2470.197185914567, 2486.080150344366, 13580.295997376028, 14068.718625627533, 14208.715825683532, 14225.715485690333, 14244.21656808875, 1832.7342535332302, 1859.3956963986623, 1864.2263460663808, 1892.981070189308, 1917.4631103291101, 63595.0, 64461.0, 65246.3475365245, 65614.67192664054, 66776.3322366775, 9491.810163796685, 9751.902480975099, 9917.107460328605, 9968.501574921225, 9985.60057597688, 14221.64445888861, 14249.145051296955, 14280.50018249377, 14343.426262949366, 14355.497557585435, 8230.753077407688, 8290.792730181673, 8316.459430137143, 8434.746957591282, 8450.746477605559, 8392.412531122885, 8479.703210387606, 8531.317494600416, 8570.657173713107, 8615.526146062026, 5974.9402505974385, 5992.161097446361, 6005.189299444606, 6124.326324104345, 6172.321044685081, 1587.857092861625, 1740.2429942974848, 1771.1586996176713, 1782.6880295948158, 1817.3094224194722, 913.456493386434, 1059.4755595980039, 1072.399456304472, 1076.2735153771173, 1128.9830652540054, 16617.0, 16887.408940687015, 17183.956845312372, 17302.307907683804, 17428.738568921475, 990.8166989106894, 1015.5785349080197, 1040.9115225205792, 1045.430240518919, 1114.1810769084716, 10322.638707645196, 10589.15286777056, 10649.148068154529, 10692.732681683021, 10778.0, 332001.0, 333105.0, 338643.0, 345018.0, 444145.0, 69686.303136969, 74402.0, 77629.0, 80423.59788201022, 81220.0, 497.80585571627097, 512.7385033632875, 513.7559659161943, 517.056372120881, 523.5968304405586, 10570.682879513626, 10677.437415020495, 10889.509972051119, 10983.890161098287, 10987.780244394908, 33921.32157356889, 34170.82914585411, 34354.0, 34835.0, 34957.65042349646, 45087.54912450833, 48404.75797620989, 48683.269750954474, 48721.756391217816, 49319.50680493293, 8272.503649781032, 8326.666933322842, 8385.329173666214, 8387.245147936716, 8467.983841939007, 11694.356810375511, 11888.405579720806, 12000.15998880105, 12036.157468977088, 12117.515299387926, 10588.364698118137, 10632.734181645521, 11097.611583594859, 11143.442827858737, 11157.832632510681, 10426.113780328453, 10650.147988160774, 10707.57169713234, 10736.194785391282, 10813.513391897226, 10453.372797632166, 10742.409167495864, 10834.512446940063, 10838.458077096271, 11209.775804484028, 8350.916490835014, 8369.204925532065, 8452.535110568977, 8457.36569757283, 8470.407071504935, 8340.842699410756, 10400.739981500523, 10810.459477026274, 10916.0, 11029.283096598696], "unit": "score", "name": "jquery.html", "value": 8584.580662383123}, {"lowerIsBetter": false, "replicates": [1414.0, 1534.4399294257596, 1566.0838409530427, 1782.8751987360881, 1923.903804809759, 7936.4841285316415, 8140.592970351481, 8154.592270386486, 8161.1430799765985, 8169.264766171043, 7987.480813747103, 8135.430519863612, 8153.347732181426, 8171.91828081719, 8189.222023907734, 2393.150431596784, 2407.831451798375, 2413.78275955164, 2419.346776370379, 2421.6609674645565, 2276.8520046197027, 2279.418748219202, 2314.0975019742314, 2316.4093156245135, 2336.4392545788974, 2371.2412028150998, 2398.2325655790155, 2398.2325655790155, 2404.4589967257316, 2416.118116887341, 2345.6950596422525, 2366.420227044368, 2396.7363590005084, 2413.9758602413926, 2416.7099948006176, 2430.368104292879, 2464.2360868130936, 2471.8146139039463, 2478.21936090131, 2481.8759062047006, 8310.127436619128, 8327.750167494985, 8339.374546908946, 8341.45780524264, 8365.28895043922, 5061.266116413136, 5183.118869792107, 5202.583793296527, 5204.271402003723, 5205.947940520622, 3122.2506598416444, 3127.6403213630497, 3159.873605055795, 3226.1934516370907, 3258.5926759155104, 977.3451787302524, 1010.1111022300402, 1023.2121266624732, 1028.5834237133972, 1066.861308029959, 11649.650510484698, 11685.649430517098, 11694.707632309175, 11701.531938722526, 11711.414429278502, 4411.845585404495, 4553.590176884097, 4556.794944227518, 4585.724856508554, 4618.95381046192, 9798.167155791694, 9825.459599722084, 9829.754256143511, 9863.80272394548, 9869.0, 5111.539961403417, 5169.172932330809, 5169.250458683545, 5182.792688292501, 5222.399424066205, 4087.3868919661695, 4602.125596136723, 4614.930776038362, 4694.718316900997, 4699.342092107107, 3781.697464202857, 3839.1745774658584, 3867.7099217558793, 3877.282702699953, 3929.096307849211, 1256.4597223193932, 1263.286243272548, 1274.4710944957924, 1288.4588472841428, 1295.229338543565, 1311.0691409099645, 1317.703516708752, 1347.9460821567225, 1495.8429364916744, 1496.3715239599394, 7714.537127772352, 7802.648880800378, 7885.093214280431, 7908.288254057163, 7910.446268761131, 493.3118299971591, 494.34746135101324, 494.39930484461553, 522.5349438999293, 541.6452223793422, 6000.189974353407, 6001.309849367379, 6004.639721616717, 6057.515398768088, 6062.302835173923, 9793.412395256164, 10015.849762253572, 10046.146077583488, 10076.09315161639, 10077.294589378673, 9543.952280238555, 9654.75863103428, 9812.116909478182, 9832.950835245922, 9871.75320616976, 7774.883376749353, 7895.368370530229, 7971.760847174594, 7973.880391794128, 7978.5611791350875, 7623.961880190785, 7643.388528917784, 7738.535687858746, 7741.45809793309, 7799.220077992155, 9094.863577046483, 9215.308851836005, 9296.302777291865, 9301.906980930104, 9486.241100712065, 9416.576254068446, 9517.333786634868, 9684.225261979165, 9687.515624218902, 9687.612495500101, 6320.336364681642, 6948.930510694829, 7093.0, 7281.308275713799, 7393.260673932564, 7794.337481314152, 7820.374370050268, 7854.096778870503, 7880.566568838769, 7886.842263154819, 7159.57042577447, 7315.305046020832, 7322.707091716272, 7364.96317518409, 7391.632547978641, 6997.1253593300835, 7045.436365090883, 7153.213146553979, 7179.928200718135, 7181.820454488679, 7333.779986600411, 7487.588182650006, 7497.212792656693, 7505.099388073466, 7507.286807753473, 6746.966265168643, 6750.932490675031, 6818.965905170442, 6839.760608378683, 6845.383915447634, 6691.1636045494315, 6766.289539598468, 6776.6950487227205, 6785.423239024541, 6787.490938179558], "unit": "score", "name": "mootools.html", "value": 4671.283872685756}, {"lowerIsBetter": false, "replicates": [343.9982800086, 344.3835534393436, 349.6032003675827, 350.46204076742174, 354.865151242528, 5944.22725045744, 5975.28296604407, 6006.849828754283, 6011.879762404749, 6032.487238584715, 5935.436133567315, 5945.970270148654, 5948.018576934812, 5949.851253718648, 5969.044952807551, 4421.6683748718815, 4520.231560634684, 4606.424196975378, 4653.488116307203, 4678.532146785328, 4670.0, 4673.859784206479, 4687.062587482517, 4693.671442998992, 4705.223638099709, 4622.930656040162, 4643.837465688702, 4645.372874661928, 4646.233371493699, 4657.650676199281, 4361.60745532902, 4520.028193938303, 4572.154151481986, 4601.332806743004, 4605.217113090783, 4116.876493705194, 4121.258173528764, 4123.134141830219, 4124.298869192245, 4128.752274863517, 5655.886882262373, 5663.037283661787, 5668.546516278688, 5676.517496012844, 5677.517411020068, 5376.220448035052, 5391.975524650304, 5394.91907621386, 5395.136778115482, 5408.91886621701, 6288.717007734663, 6289.96855015722, 6294.150289710876, 6297.0554416837385, 6298.937010629881, 4424.491183513905, 4540.79566419512, 4546.04533048057, 4556.726596404226, 4597.95402045982, 6477.870442591122, 6497.805065848032, 6557.409833115043, 6558.606483610999, 6562.44219241365, 4646.674732768742, 4649.883752906137, 4653.488116307203, 4656.231721765938, 4661.813527458931, 4715.646326525524, 4716.151092803259, 4720.905581888343, 4722.244440889442, 4723.0789995951145, 5361.678299302054, 5371.409144994126, 5373.570114390839, 5377.247185394048, 5379.757910894019, 6211.223597050369, 6325.462335701425, 6343.207099112611, 6348.143000694847, 6355.110284560165, 1649.9752503712455, 1655.6440365321273, 1661.567992321981, 1667.6075476976619, 1669.8580620647137, 1053.2311412668794, 1133.7222380516826, 1135.5628083187867, 1151.5681619392728, 1161.8838116188483, 6115.1744514490865, 6121.755129794758, 6121.938780612226, 6128.050152226323, 6129.478994285447, 6508.284088750233, 6514.5114116441455, 6523.315051919575, 6525.608463492111, 6531.902021469682, 6098.54260930432, 6100.847478813065, 6106.847328816815, 6118.663473508911, 6118.724657390339, 3492.860285588548, 3515.0140170803415, 3546.733994950389, 3548.059764162499, 3553.040679016651, 6618.768343107968, 6725.293844146392, 6777.932220677829, 6831.795046148623, 6878.484113691493, 6722.327767223336, 6734.461243100638, 6752.257251702309, 6776.93223067763, 6786.049953006583, 6827.658617069127, 6849.623270720059, 6853.9314606853295, 6856.0, 6860.656967151723, 6603.966980165068, 6606.273309935807, 6608.801735947929, 6612.305707900794, 6623.039659249478, 6275.717592708431, 6437.388448097423, 6495.805125846232, 6497.902531462127, 6506.446952008943, 6777.0, 6820.795376138723, 6823.044773731781, 6830.21452532965, 6832.521723479309, 4577.519360467103, 4606.631469482366, 4611.538846115362, 4613.746243956614, 4616.353710480603, 6598.571092878948, 6607.108040414482, 6608.173978252718, 6608.867822643617, 6619.933800662125, 6191.81424557264, 6409.807705768834, 6414.711337989708, 6415.550911436155, 6419.903701444388, 6310.211223597051, 6358.586691865014, 6359.236891573041, 6419.646919419477, 6448.871022579428, 6244.750209991731, 6246.500279977682, 6292.811215663537, 6299.937000629935, 6301.298649364738, 6447.70985305653, 6461.901476749058, 6464.0627109069865, 6477.77327793525, 6478.287388387368, 6040.516758659384, 6150.876982460236, 6282.340354262919, 6315.400036996478, 6319.6840157991], "unit": "score", "name": "prototype.html", "value": 4839.877759350353}, {"lowerIsBetter": false, "replicates": [702.852400995791, 782.624340316648, 790.6876783670454, 790.9644066017029, 822.9753107406776, 14281.357338919748, 14459.132452052883, 14526.055806372604, 14544.854551454495, 14557.0, 14103.788443173335, 14187.574372768808, 14198.645033874158, 14206.573802785908, 14218.217998010105, 755.5202446446505, 905.1536813079758, 920.0339643374464, 920.397139873384, 922.5341202692631, 909.2998391238742, 909.6634245329204, 913.2237598041678, 915.7847905742178, 919.384012711485, 793.9801504962364, 991.1179050644931, 991.9752006199831, 992.1318846009741, 994.0854413939194, 983.5918093990986, 987.7135630667134, 987.9012098790135, 989.6437282578266, 990.2622546203053, 726.0778810910115, 728.4099879097947, 729.1833146875481, 730.8684436801374, 731.6780616528764, 14051.78922316166, 14061.086029408056, 14070.507532236425, 14080.577582672537, 14126.92936535321, 13447.3948672309, 13479.0, 13566.796498052538, 13999.720005599933, 14325.498607548685, 10393.584256629802, 10572.207084468695, 10642.414667193301, 10704.946475267652, 10912.727181820439, 3613.819309034564, 3629.114853691295, 3706.703463722896, 3710.666040056408, 3750.2124553843723, 51123.74438127823, 51368.486315136746, 51671.0, 51680.0, 51807.0, 9765.267604929659, 9877.604895804086, 9996.3002589818, 10130.442825644514, 10145.731783527059, 19674.213031478866, 19681.40955771329, 19705.310314138937, 19710.70433943492, 19721.60556788856, 7755.573443460664, 7932.762017139495, 8265.049519305237, 8297.502149871027, 8377.83244335122, 4532.1842068427995, 4542.1824071667415, 4622.699524530894, 4639.280911458729, 4715.811367545329, 3356.429407000816, 3375.071855239829, 3380.4253276942486, 3385.170633194834, 3385.932281354359, 570.3925319534683, 584.6696616411799, 593.5844908564022, 594.0, 601.8886505996404, 605.12257227021, 669.9062131301622, 685.2564967010849, 698.6751160710294, 709.0321710864632, 8659.913400866037, 8817.426867253607, 8898.288136949028, 8943.105689431004, 8957.283417326598, 658.4777776127465, 672.1900110366996, 679.6941376380648, 681.7852376501386, 689.7827184436986, 3910.608939106067, 3916.921661566753, 3921.1961547882615, 3947.585503522089, 4032.9395059074136, 59039.70480147572, 59438.40561594415, 60117.69941150266, 60139.39860601338, 60139.398606014256, 48490.5150948486, 50953.490465095616, 51747.74126129345, 52211.73894130505, 52504.47495525072, 43718.344224836655, 43962.56037439649, 44530.55469445329, 47465.76267118642, 47889.76055119702, 7845.686172553034, 8222.753317400488, 8284.25441710249, 8419.031811341774, 8658.134186581543, 34028.31943361169, 34300.656993429744, 35225.82387088048, 35729.46405803863, 37084.6291537092, 42202.577974219865, 42286.57713422826, 43040.35439468473, 43717.562824372624, 43806.34290485709, 10658.680239592824, 10848.511816968097, 10950.34297942126, 11036.613718519813, 11077.390743509184, 11923.344216068199, 12176.147669663393, 12193.69515762113, 12369.0, 12552.246865188117, 11539.307641541534, 11637.359945203096, 11662.300261984308, 11703.590374336858, 11901.583444579399, 10635.14918806509, 11113.222074455034, 11587.130965177477, 11641.941790290994, 11866.881331186923, 11312.434378281218, 11364.94317528407, 11422.94288528552, 11670.70823229426, 11695.181337306647, 9456.763580910532, 9541.379810312585, 9617.086376794474, 9619.134277915022, 9891.35706179096, 9807.558659860466, 9910.801783964136, 9978.0, 9992.0, 9998.700038998843], "unit": "score", "name": "yui.html", "value": 6575.37975394049}], "name": "dromaeo_css", "value": 7106.9289453725405}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 112.0, 114.0, 113.0, 111.0, 113.0, 112.0, 111.0, 111.0, 123.0], "unit": "score", "name": "ai-astar", "value": 113.1}, {"lowerIsBetter": true, "replicates": [162.0, 128.0, 153.0, 187.0, 129.0, 159.0, 149.0, 130.0, 169.0, 129.0], "unit": "score", "name": "audio-beat-detection", "value": 149.5}, {"lowerIsBetter": true, "replicates": [162.0, 162.0, 162.0, 161.0, 161.0, 162.0, 168.0, 160.0, 163.0, 161.0], "unit": "score", "name": "audio-dft", "value": 162.2}, {"lowerIsBetter": true, "replicates": [77.0, 77.0, 76.0, 156.0, 76.0, 75.0, 77.0, 80.0, 173.0, 74.0], "unit": "score", "name": "audio-fft", "value": 94.1}, {"lowerIsBetter": true, "replicates": [94.0, 94.0, 157.0, 93.0, 93.0, 94.0, 144.0, 93.0, 93.0, 136.0], "unit": "score", "name": "audio-oscillator", "value": 109.1}, {"lowerIsBetter": true, "replicates": [118.0, 117.0, 117.0, 117.0, 117.0, 116.0, 117.0, 117.0, 117.0, 116.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.9}, {"lowerIsBetter": true, "replicates": [147.0, 146.0, 145.0, 146.0, 146.0, 146.0, 145.0, 147.0, 145.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 145.9}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 96.0, 96.0, 96.0, 95.0, 95.0, 95.0, 96.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.4}, {"lowerIsBetter": true, "replicates": [52.0, 57.0, 56.0, 55.0, 54.0, 55.0, 55.0, 54.0, 65.0, 53.0], "unit": "score", "name": "json-parse-financial", "value": 55.6}, {"lowerIsBetter": true, "replicates": [65.0, 65.0, 72.0, 66.0, 65.0, 65.0, 66.0, 66.0, 66.0, 66.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 66.2}, {"lowerIsBetter": true, "replicates": [80.0, 81.0, 80.0, 81.0, 81.0, 88.0, 80.0, 80.0, 82.0, 87.0], "unit": "score", "name": "stanford-crypto-aes", "value": 82.0}, {"lowerIsBetter": true, "replicates": [126.0, 117.0, 116.0, 113.0, 114.0, 115.0, 118.0, 115.0, 115.0, 118.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 116.7}, {"lowerIsBetter": true, "replicates": [150.0, 138.0, 148.0, 152.0, 141.0, 137.0, 142.0, 146.0, 148.0, 148.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 145.0}, {"lowerIsBetter": true, "replicates": [73.0, 69.0, 69.0, 70.0, 67.0, 67.0, 68.0, 70.0, 67.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 68.6}], "name": "kraken", "value": 1520.3}]} 06:47:32 INFO - Return code: 0 06:47:32 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 06:47:32 INFO - # TBPL SUCCESS # 06:47:32 INFO - Running post-action listener: _resource_record_post_action 06:47:32 INFO - Running post-run listener: _resource_record_post_run 06:47:34 INFO - Total resource usage - Wall time: 1184s; CPU: 13.0%; Read bytes: 12288; Write bytes: 449449984; Read time: 20; Write time: 315596 06:47:34 INFO - install - Wall time: 13s; CPU: 14.0%; Read bytes: 0; Write bytes: 237813760; Read time: 0; Write time: 225392 06:47:34 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 12288; Write bytes: 211320832; Read time: 20; Write time: 90176 06:47:34 INFO - Running post-run listener: _upload_blobber_files 06:47:34 INFO - Blob upload gear active. 06:47:34 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:47:34 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:47:34 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:47:34 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:47:34 INFO - (blobuploader) - INFO - Open directory for files ... 06:47:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 06:47:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:47:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:47:35 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 06:47:35 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:47:35 INFO - (blobuploader) - INFO - Done attempting. 06:47:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 06:47:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:47:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:47:36 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 06:47:36 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:47:36 INFO - (blobuploader) - INFO - Done attempting. 06:47:36 INFO - (blobuploader) - INFO - Iteration through files over. 06:47:36 INFO - Return code: 0 06:47:36 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:47:36 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:47:36 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/96fa444694e43b7b1cb8abf726143e8febca4de9601774e72e7f80ba41f7e34b9ea097b741b278590b70f35ca37076718f2080ce7e1c74d0855e93c4b3ecd352", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/6c10b380fc72554d68832997cfc57e77be0cd7f9b1fedffd027402a40d78dbaac8cf0d2e0296a778ba4c239cb4c1924880534754d730174da38a516143a00eb4"} 06:47:36 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:47:36 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:47:36 INFO - Contents: 06:47:36 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/96fa444694e43b7b1cb8abf726143e8febca4de9601774e72e7f80ba41f7e34b9ea097b741b278590b70f35ca37076718f2080ce7e1c74d0855e93c4b3ecd352", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/6c10b380fc72554d68832997cfc57e77be0cd7f9b1fedffd027402a40d78dbaac8cf0d2e0296a778ba4c239cb4c1924880534754d730174da38a516143a00eb4"} 06:47:36 INFO - Running post-run listener: copy_logs_to_upload_dir 06:47:36 INFO - Copying logs to upload dir... 06:47:36 INFO - mkdir: /builds/slave/test/build/upload/logs 06:47:36 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1223.522479 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 23 secs) (at 2016-06-06 06:47:35.228366) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-06 06:47:35.231871) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/96fa444694e43b7b1cb8abf726143e8febca4de9601774e72e7f80ba41f7e34b9ea097b741b278590b70f35ca37076718f2080ce7e1c74d0855e93c4b3ecd352", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/6c10b380fc72554d68832997cfc57e77be0cd7f9b1fedffd027402a40d78dbaac8cf0d2e0296a778ba4c239cb4c1924880534754d730174da38a516143a00eb4"} build_url:https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011270 build_url: 'https://queue.taskcluster.net/v1/task/Gc0Yx5e4QHCbVdvLiy2A0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/96fa444694e43b7b1cb8abf726143e8febca4de9601774e72e7f80ba41f7e34b9ea097b741b278590b70f35ca37076718f2080ce7e1c74d0855e93c4b3ecd352", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/6c10b380fc72554d68832997cfc57e77be0cd7f9b1fedffd027402a40d78dbaac8cf0d2e0296a778ba4c239cb4c1924880534754d730174da38a516143a00eb4"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-06 06:47:35.257092) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 06:47:35.257481) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1465219630.259331-1829011051 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004513 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-06 06:47:35.344117) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-06 06:47:35.344463) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-06 06:47:35.344758) ========= ========= Total master_lag: 0.17 =========