builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-030 starttime: 1461753572.97 results: success (0) buildid: 20160425062348 builduid: abe90fc74b164da98c10377025c22763 revision: 8551b253f4061db31e4be7829c2f70c2610caf42 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:32.970818) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:32.971396) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:32.971675) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:33.001726) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:33.002038) ========= 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=4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-27 03:39:33-- 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% 221M=0s 2016-04-27 03:39:33 (221 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.085184 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:33.101600) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:33.101874) ========= 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=4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014523 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:33.151417) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:33.151721) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 8551b253f4061db31e4be7829c2f70c2610caf42 --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-aurora --rev 8551b253f4061db31e4be7829c2f70c2610caf42 --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=4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-27 03:39:33,403 truncating revision to first 12 chars 2016-04-27 03:39:33,403 Setting DEBUG logging. 2016-04-27 03:39:33,403 attempt 1/10 2016-04-27 03:39:33,403 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/8551b253f406?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-27 03:39:34,042 unpacking tar archive at: mozilla-aurora-8551b253f406/testing/mozharness/ program finished with exit code 0 elapsedTime=0.924906 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:34.089365) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:34.089631) ========= script_repo_revision: 8551b253f4061db31e4be7829c2f70c2610caf42 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:34.090021) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:34.090289) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-27 03:39:34.100108) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 56 secs) (at 2016-04-27 03:39:34.100371) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 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-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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=4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:39:34 INFO - MultiFileLogger online at 20160427 03:39:34 in /builds/slave/test 03:39:34 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 03:39:34 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:39:34 INFO - {'append_to_log': False, 03:39:34 INFO - 'base_work_dir': '/builds/slave/test', 03:39:34 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 03:39:34 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:39:34 INFO - 'branch': 'Mozilla-Aurora', 03:39:34 INFO - 'buildbot_json_path': 'buildprops.json', 03:39:34 INFO - 'config_files': ('talos/linux_config.py',), 03:39:34 INFO - 'default_actions': ('clobber', 03:39:34 INFO - 'read-buildbot-config', 03:39:34 INFO - 'download-and-extract', 03:39:34 INFO - 'populate-webroot', 03:39:34 INFO - 'create-virtualenv', 03:39:34 INFO - 'install', 03:39:34 INFO - 'run-tests'), 03:39:34 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:39:34 INFO - 'download_minidump_stackwalk': True, 03:39:34 INFO - 'download_symbols': 'ondemand', 03:39:34 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:39:34 INFO - 'tooltool.py': '/tools/tooltool.py', 03:39:34 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:39:34 INFO - '/tools/misc-python/virtualenv.py')}, 03:39:34 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:39:34 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:39:34 INFO - 'installer_path': 'installer.exe', 03:39:34 INFO - 'log_level': 'info', 03:39:34 INFO - 'log_name': 'talos', 03:39:34 INFO - 'log_to_console': True, 03:39:34 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:39:34 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:39:34 INFO - 'opt_config_files': (), 03:39:34 INFO - 'pip_index': False, 03:39:34 INFO - 'sps_profile': False, 03:39:34 INFO - 'sps_profile_interval': 0, 03:39:34 INFO - 'suite': 'dromaeojs', 03:39:34 INFO - 'system_bits': '32', 03:39:34 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:39:34 INFO - 'title': 'talos-linux64-ix-030', 03:39:34 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:39:34 INFO - 'use_talos_json': True, 03:39:34 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:39:34 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:39:34 INFO - 'work_dir': 'build'} 03:39:34 INFO - ##### 03:39:34 INFO - ##### Running clobber step. 03:39:34 INFO - ##### 03:39:34 INFO - Running pre-action listener: _resource_record_pre_action 03:39:34 INFO - Running main action method: clobber 03:39:34 INFO - rmtree: /builds/slave/test/build 03:39:34 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:39:35 INFO - Running post-action listener: _resource_record_post_action 03:39:35 INFO - ##### 03:39:35 INFO - ##### Running read-buildbot-config step. 03:39:35 INFO - ##### 03:39:35 INFO - Running pre-action listener: _resource_record_pre_action 03:39:35 INFO - Running main action method: read_buildbot_config 03:39:35 INFO - Using buildbot properties: 03:39:35 INFO - { 03:39:35 INFO - "project": "", 03:39:35 INFO - "product": "firefox", 03:39:35 INFO - "script_repo_revision": "production", 03:39:35 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 03:39:35 INFO - "repository": "", 03:39:35 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 03:39:35 INFO - "buildid": "20160425062348", 03:39:35 INFO - "pgo_build": "True", 03:39:35 INFO - "basedir": "/builds/slave/test", 03:39:35 INFO - "buildnumber": 292, 03:39:35 INFO - "slavename": "talos-linux64-ix-030", 03:39:35 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 03:39:35 INFO - "platform": "ubuntu64_hw", 03:39:35 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 03:39:35 INFO - "branch": "mozilla-aurora", 03:39:35 INFO - "repo_path": "releases/mozilla-aurora", 03:39:35 INFO - "revision": "8551b253f4061db31e4be7829c2f70c2610caf42", 03:39:35 INFO - "stage_platform": "linux64-pgo", 03:39:35 INFO - "builduid": "abe90fc74b164da98c10377025c22763", 03:39:35 INFO - "slavebuilddir": "test" 03:39:35 INFO - } 03:39:35 INFO - Found installer url https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2. 03:39:35 INFO - Running post-action listener: _resource_record_post_action 03:39:35 INFO - ##### 03:39:35 INFO - ##### Running download-and-extract step. 03:39:35 INFO - ##### 03:39:35 INFO - Running pre-action listener: _resource_record_pre_action 03:39:35 INFO - Running main action method: download_and_extract 03:39:35 INFO - mkdir: /builds/slave/test/build/tests 03:39:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:39:35 INFO - https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 03:39:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 03:39:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 03:39:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 03:39:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 03:39:38 INFO - Downloaded 1448 bytes. 03:39:38 INFO - Reading from file /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 03:39:38 INFO - Using the following test package requirements: 03:39:38 INFO - {u'common': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 03:39:38 INFO - u'cppunittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 03:39:38 INFO - u'firefox-47.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 03:39:38 INFO - u'gtest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 03:39:38 INFO - u'firefox-47.0a2.en-US.linux-x86_64.gtest.tests.zip'], 03:39:38 INFO - u'jittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 03:39:38 INFO - u'jsshell-linux-x86_64.zip'], 03:39:38 INFO - u'mochitest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 03:39:38 INFO - u'firefox-47.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 03:39:38 INFO - u'mozbase': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 03:39:38 INFO - u'reftest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 03:39:38 INFO - u'firefox-47.0a2.en-US.linux-x86_64.reftest.tests.zip'], 03:39:38 INFO - u'talos': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 03:39:38 INFO - u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'], 03:39:38 INFO - u'web-platform': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 03:39:38 INFO - u'firefox-47.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 03:39:38 INFO - u'webapprt': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 03:39:38 INFO - u'xpcshell': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 03:39:38 INFO - u'firefox-47.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 03:39:38 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 03:39: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')]} 03:39:38 INFO - https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:39:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 03:39:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 03:39:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 03:39:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:39:42 INFO - Downloaded 23359918 bytes. 03:39:42 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 03:39:42 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 03:39:43 INFO - Return code: 0 03:39:43 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 03:39:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:39:43 INFO - https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:39:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 03:39:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 03:39:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 03:39:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:40:07 INFO - Downloaded 23359918 bytes. 03:40:07 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 03:40:07 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 03:40:08 INFO - Return code: 0 03:40:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:08 INFO - https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 03:40:08 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 03:40:08 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 03:40:08 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 03:40:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 03:40:10 INFO - Downloaded 10845194 bytes. 03:40:10 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 03:40:10 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 03:40:10 INFO - Return code: 0 03:40:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:10 INFO - https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 03:40:10 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 03:40:10 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 03:40:10 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 03:40:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 03:40:14 INFO - Downloaded 60835591 bytes. 03:40:14 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 03:40:14 INFO - mkdir: /builds/slave/test/properties 03:40:14 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:40:14 INFO - Writing to file /builds/slave/test/properties/build_url 03:40:14 INFO - Contents: 03:40:14 INFO - build_url:https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 03:40:14 INFO - Running post-action listener: _resource_record_post_action 03:40:14 INFO - Running post-action listener: set_extra_try_arguments 03:40:14 INFO - ##### 03:40:14 INFO - ##### Running populate-webroot step. 03:40:14 INFO - ##### 03:40:14 INFO - Running pre-action listener: _resource_record_pre_action 03:40:14 INFO - Running main action method: populate_webroot 03:40:14 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:40:14 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:40:14 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:40:14 INFO - '--tppagecycles', 03:40:14 INFO - '7'], 03:40:14 INFO - 'tests': ['tsvgm']}}, 03:40:14 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 03:40:14 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 03:40:14 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:40:14 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 03:40:14 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 03:40:14 INFO - 'tests': ['dromaeo_css', 'kraken']}, 03:40:14 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:40:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:40:14 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:40:14 INFO - 'talos_options': ['--e10s'], 03:40:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:40:14 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:40:14 INFO - 'tests': ['damp', 'tps']}, 03:40:14 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:40:14 INFO - 'talos_options': ['--e10s'], 03:40:14 INFO - 'tests': ['damp', 'tps']}, 03:40:14 INFO - 'g3': {'tests': ['dromaeo_dom']}, 03:40:14 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:40:14 INFO - 'other': {'tests': ['a11yr', 03:40:14 INFO - 'ts_paint', 03:40:14 INFO - 'tpaint', 03:40:14 INFO - 'sessionrestore', 03:40:14 INFO - 'sessionrestore_no_auto_restore', 03:40:14 INFO - 'tabpaint']}, 03:40:14 INFO - 'other-e10s': {'talos_options': ['--e10s'], 03:40:14 INFO - 'tests': ['a11yr', 03:40:14 INFO - 'ts_paint', 03:40:14 INFO - 'tpaint', 03:40:14 INFO - 'sessionrestore', 03:40:14 INFO - 'sessionrestore_no_auto_restore', 03:40:14 INFO - 'tabpaint']}, 03:40:14 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 03:40:14 INFO - 'tests': ['a11yr', 03:40:14 INFO - 'ts_paint', 03:40:14 INFO - 'tpaint', 03:40:14 INFO - 'sessionrestore', 03:40:14 INFO - 'sessionrestore_no_auto_restore', 03:40:14 INFO - 'tabpaint']}, 03:40:14 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 03:40:14 INFO - 'tests': ['a11yr', 03:40:14 INFO - 'ts_paint', 03:40:14 INFO - 'tpaint', 03:40:14 INFO - 'sessionrestore', 03:40:14 INFO - 'sessionrestore_no_auto_restore', 03:40:14 INFO - 'tabpaint']}, 03:40:14 INFO - 'other_l64': {'tests': ['a11yr', 03:40:14 INFO - 'ts_paint', 03:40:14 INFO - 'tpaint', 03:40:14 INFO - 'sessionrestore', 03:40:14 INFO - 'sessionrestore_no_auto_restore', 03:40:14 INFO - 'tabpaint']}, 03:40:14 INFO - 'other_nol64': {'tests': ['a11yr', 03:40:14 INFO - 'ts_paint', 03:40:14 INFO - 'tpaint', 03:40:14 INFO - 'sessionrestore', 03:40:14 INFO - 'sessionrestore_no_auto_restore', 03:40:14 INFO - 'tabpaint']}, 03:40:14 INFO - 'svgr': {'tests': ['tsvgx', 03:40:14 INFO - 'tsvgr_opacity', 03:40:14 INFO - 'tart', 03:40:14 INFO - 'tscrollx', 03:40:14 INFO - 'cart']}, 03:40:14 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 03:40:14 INFO - 'tests': ['tsvgx', 03:40:14 INFO - 'tsvgr_opacity', 03:40:14 INFO - 'tart', 03:40:14 INFO - 'tscrollx', 03:40:14 INFO - 'cart']}, 03:40:14 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:40:14 INFO - 'tests': ['tp5o']}, 03:40:14 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:40:14 INFO - 'talos_options': ['--e10s'], 03:40:14 INFO - 'tests': ['tp5o']}, 03:40:14 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:40:14 INFO - 'talos_options': ['--xperf_path', 03:40:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:40:14 INFO - 'tests': ['tp5n']}, 03:40:14 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:40:14 INFO - 'talos_options': ['--e10s', 03:40:14 INFO - '--xperf_path', 03:40:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:40:14 INFO - 'tests': ['tp5n']}}, 03:40:14 INFO - 'talos.zip': {'path': '', 03:40:14 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:40:14 INFO - Running post-action listener: _resource_record_post_action 03:40:14 INFO - ##### 03:40:14 INFO - ##### Running create-virtualenv step. 03:40:14 INFO - ##### 03:40:14 INFO - Running pre-action listener: _resource_record_pre_action 03:40:14 INFO - Running main action method: create_virtualenv 03:40:14 INFO - Creating virtualenv /builds/slave/test/build/venv 03:40:14 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 03:40:14 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:40:15 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:40:15 INFO - Using real prefix '/usr' 03:40:15 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:40:15 INFO - Installing distribute.............................................................................................................................................................................................done. 03:40:17 INFO - Installing pip.................done. 03:40:17 INFO - Return code: 0 03:40:17 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:40:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:40:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:40:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:17 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 0x7f33a72abf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29f5410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a84160>, '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 0x2a85060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a854f0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', '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 03:40:17 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 03:40:17 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 03:40:17 INFO - Using env: {'DISPLAY': ':0', 03:40:17 INFO - 'HOME': '/home/cltbld', 03:40:17 INFO - 'LANG': 'en_US.UTF-8', 03:40:17 INFO - 'LANGUAGE': 'en_US:en', 03:40:17 INFO - 'LOGNAME': 'cltbld', 03:40:17 INFO - 'MAIL': '/var/mail/cltbld', 03:40:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:40:17 INFO - 'MOZ_NO_REMOTE': '1', 03:40:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:40:17 INFO - 'NO_EM_RESTART': '1', 03:40:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:40:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:40:17 INFO - 'PWD': '/builds/slave/test', 03:40:17 INFO - 'SHELL': '/bin/bash', 03:40:17 INFO - 'SHLVL': '1', 03:40:17 INFO - 'TERM': 'linux', 03:40:17 INFO - 'TMOUT': '86400', 03:40:17 INFO - 'USER': 'cltbld', 03:40:17 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', 03:40:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:40:17 INFO - '_': '/tools/buildbot/bin/python'} 03:40:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:40:17 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 03:40:17 INFO - Cleaning up... 03:40:17 INFO - Return code: 0 03:40:17 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 03:40:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:40:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:40:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:17 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 0x7f33a72abf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29f5410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a84160>, '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 0x2a85060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a854f0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', '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 03:40:17 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 03:40:17 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 03:40:17 INFO - Using env: {'DISPLAY': ':0', 03:40:17 INFO - 'HOME': '/home/cltbld', 03:40:17 INFO - 'LANG': 'en_US.UTF-8', 03:40:17 INFO - 'LANGUAGE': 'en_US:en', 03:40:17 INFO - 'LOGNAME': 'cltbld', 03:40:17 INFO - 'MAIL': '/var/mail/cltbld', 03:40:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:40:17 INFO - 'MOZ_NO_REMOTE': '1', 03:40:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:40:17 INFO - 'NO_EM_RESTART': '1', 03:40:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:40:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:40:17 INFO - 'PWD': '/builds/slave/test', 03:40:17 INFO - 'SHELL': '/bin/bash', 03:40:17 INFO - 'SHLVL': '1', 03:40:17 INFO - 'TERM': 'linux', 03:40:17 INFO - 'TMOUT': '86400', 03:40:17 INFO - 'USER': 'cltbld', 03:40:17 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', 03:40:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:40:17 INFO - '_': '/tools/buildbot/bin/python'} 03:40:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:40:17 INFO - Downloading/unpacking psutil>=0.7.1 03:40:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:40:19 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:40:19 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:40:19 INFO - Installing collected packages: psutil 03:40:19 INFO - Running setup.py install for psutil 03:40:20 INFO - building 'psutil._psutil_linux' extension 03:40:20 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 03:40:20 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 03:40:20 INFO - building 'psutil._psutil_posix' extension 03:40:20 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 03:40:20 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 03:40:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:40:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:40:20 INFO - Successfully installed psutil 03:40:20 INFO - Cleaning up... 03:40:20 INFO - Return code: 0 03:40:20 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 03:40:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:40:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:40:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:20 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 0x7f33a72abf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29f5410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a84160>, '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 0x2a85060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a854f0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', '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 03:40:20 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 03:40:20 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 03:40:20 INFO - Using env: {'DISPLAY': ':0', 03:40:20 INFO - 'HOME': '/home/cltbld', 03:40:20 INFO - 'LANG': 'en_US.UTF-8', 03:40:20 INFO - 'LANGUAGE': 'en_US:en', 03:40:20 INFO - 'LOGNAME': 'cltbld', 03:40:20 INFO - 'MAIL': '/var/mail/cltbld', 03:40:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:40:20 INFO - 'MOZ_NO_REMOTE': '1', 03:40:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:40:20 INFO - 'NO_EM_RESTART': '1', 03:40:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:40:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:40:20 INFO - 'PWD': '/builds/slave/test', 03:40:20 INFO - 'SHELL': '/bin/bash', 03:40:20 INFO - 'SHLVL': '1', 03:40:20 INFO - 'TERM': 'linux', 03:40:20 INFO - 'TMOUT': '86400', 03:40:20 INFO - 'USER': 'cltbld', 03:40:20 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', 03:40:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:40:20 INFO - '_': '/tools/buildbot/bin/python'} 03:40:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:40:20 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 03:40:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:22 INFO - Downloading mozsystemmonitor-0.0.tar.gz 03:40:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:40:22 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 03:40:22 INFO - Installing collected packages: mozsystemmonitor 03:40:22 INFO - Running setup.py install for mozsystemmonitor 03:40:22 INFO - Successfully installed mozsystemmonitor 03:40:22 INFO - Cleaning up... 03:40:22 INFO - Return code: 0 03:40:22 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:40:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:40:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:40:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f33a72abf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29f5410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a84160>, '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 0x2a85060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a854f0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', '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 03:40:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 03:40:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 03:40:22 INFO - Using env: {'DISPLAY': ':0', 03:40:22 INFO - 'HOME': '/home/cltbld', 03:40:22 INFO - 'LANG': 'en_US.UTF-8', 03:40:22 INFO - 'LANGUAGE': 'en_US:en', 03:40:22 INFO - 'LOGNAME': 'cltbld', 03:40:22 INFO - 'MAIL': '/var/mail/cltbld', 03:40:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:40:22 INFO - 'MOZ_NO_REMOTE': '1', 03:40:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:40:22 INFO - 'NO_EM_RESTART': '1', 03:40:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:40:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:40:22 INFO - 'PWD': '/builds/slave/test', 03:40:22 INFO - 'SHELL': '/bin/bash', 03:40:22 INFO - 'SHLVL': '1', 03:40:22 INFO - 'TERM': 'linux', 03:40:22 INFO - 'TMOUT': '86400', 03:40:22 INFO - 'USER': 'cltbld', 03:40:22 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', 03:40:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:40:22 INFO - '_': '/tools/buildbot/bin/python'} 03:40:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:40:22 INFO - Downloading/unpacking blobuploader==1.2.4 03:40:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:24 INFO - Downloading blobuploader-1.2.4.tar.gz 03:40:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:40:24 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:40:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:40:25 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:40:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:25 INFO - Downloading docopt-0.6.1.tar.gz 03:40:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:40:25 INFO - Installing collected packages: blobuploader, requests, docopt 03:40:25 INFO - Running setup.py install for blobuploader 03:40:25 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:40:25 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:40:25 INFO - Running setup.py install for requests 03:40:26 INFO - Running setup.py install for docopt 03:40:26 INFO - Successfully installed blobuploader requests docopt 03:40:26 INFO - Cleaning up... 03:40:26 INFO - Return code: 0 03:40:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:40: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')]} 03:40:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:40:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40: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')]} 03:40:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:40:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:26 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 0x7f33a72abf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29f5410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a84160>, '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 0x2a85060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a854f0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', '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 03:40:26 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 03:40:26 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 03:40:26 INFO - Using env: {'DISPLAY': ':0', 03:40:26 INFO - 'HOME': '/home/cltbld', 03:40:26 INFO - 'LANG': 'en_US.UTF-8', 03:40:26 INFO - 'LANGUAGE': 'en_US:en', 03:40:26 INFO - 'LOGNAME': 'cltbld', 03:40:26 INFO - 'MAIL': '/var/mail/cltbld', 03:40:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:40:26 INFO - 'MOZ_NO_REMOTE': '1', 03:40:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:40:26 INFO - 'NO_EM_RESTART': '1', 03:40:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:40:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:40:26 INFO - 'PWD': '/builds/slave/test', 03:40:26 INFO - 'SHELL': '/bin/bash', 03:40:26 INFO - 'SHLVL': '1', 03:40:26 INFO - 'TERM': 'linux', 03:40:26 INFO - 'TMOUT': '86400', 03:40:26 INFO - 'USER': 'cltbld', 03:40:26 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', 03:40:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:40:26 INFO - '_': '/tools/buildbot/bin/python'} 03:40:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:40:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:40:26 INFO - Running setup.py (path:/tmp/pip-sk0V36-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:40:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:40:26 INFO - Running setup.py (path:/tmp/pip-7v0_YV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:40:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:40:26 INFO - Running setup.py (path:/tmp/pip-3QZn4a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:40:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:40:26 INFO - Running setup.py (path:/tmp/pip-IbWl78-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:40:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:40:26 INFO - Running setup.py (path:/tmp/pip-UomfsR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:40:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:40:26 INFO - Running setup.py (path:/tmp/pip-OflVJ0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:40:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:40:26 INFO - Running setup.py (path:/tmp/pip-THNoV6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:40:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:40:26 INFO - Running setup.py (path:/tmp/pip-pjmTNe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:40:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:40:26 INFO - Running setup.py (path:/tmp/pip-3DeUl_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:40:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:40:27 INFO - Running setup.py (path:/tmp/pip-R5TZqt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:40:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:40:27 INFO - Running setup.py (path:/tmp/pip-PuRhCo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:40:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:40:27 INFO - Running setup.py (path:/tmp/pip-JOxM4d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:40:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:40:27 INFO - Running setup.py (path:/tmp/pip-pzhXMO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:40:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:40:27 INFO - Running setup.py (path:/tmp/pip-Ee2EWj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:40:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:40:27 INFO - Running setup.py (path:/tmp/pip-tfEL2o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:40:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:40:27 INFO - Running setup.py (path:/tmp/pip-tlNxel-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:40:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:40:27 INFO - Running setup.py (path:/tmp/pip-KXWsf9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:40:27 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:40:27 INFO - Running setup.py install for manifestparser 03:40:27 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:40:27 INFO - Running setup.py install for mozcrash 03:40:27 INFO - Running setup.py install for mozdebug 03:40:27 INFO - Running setup.py install for mozdevice 03:40:27 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 03:40:27 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:40:28 INFO - Running setup.py install for mozfile 03:40:28 INFO - Running setup.py install for mozhttpd 03:40:28 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:40:28 INFO - Running setup.py install for mozinfo 03:40:28 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:40:28 INFO - Running setup.py install for mozInstall 03:40:28 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:40:28 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:40:28 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:40:28 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:40:28 INFO - Running setup.py install for mozleak 03:40:28 INFO - Running setup.py install for mozlog 03:40:28 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:40:28 INFO - Running setup.py install for moznetwork 03:40:28 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:40:28 INFO - Running setup.py install for mozprocess 03:40:28 INFO - Running setup.py install for mozprofile 03:40:28 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:40:28 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:40:28 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:40:28 INFO - Running setup.py install for mozrunner 03:40:29 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:40:29 INFO - Running setup.py install for mozscreenshot 03:40:29 INFO - Running setup.py install for moztest 03:40:29 INFO - Running setup.py install for mozversion 03:40:29 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:40:29 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:40:29 INFO - Cleaning up... 03:40:29 INFO - Return code: 0 03:40:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:40: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')]} 03:40:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:40:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40: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')]} 03:40:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:40:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:29 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 0x7f33a72abf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29f5410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a84160>, '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 0x2a85060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a854f0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', '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 03:40:29 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 03:40:29 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 03:40:29 INFO - Using env: {'DISPLAY': ':0', 03:40:29 INFO - 'HOME': '/home/cltbld', 03:40:29 INFO - 'LANG': 'en_US.UTF-8', 03:40:29 INFO - 'LANGUAGE': 'en_US:en', 03:40:29 INFO - 'LOGNAME': 'cltbld', 03:40:29 INFO - 'MAIL': '/var/mail/cltbld', 03:40:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:40:29 INFO - 'MOZ_NO_REMOTE': '1', 03:40:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:40:29 INFO - 'NO_EM_RESTART': '1', 03:40:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:40:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:40:29 INFO - 'PWD': '/builds/slave/test', 03:40:29 INFO - 'SHELL': '/bin/bash', 03:40:29 INFO - 'SHLVL': '1', 03:40:29 INFO - 'TERM': 'linux', 03:40:29 INFO - 'TMOUT': '86400', 03:40:29 INFO - 'USER': 'cltbld', 03:40:29 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', 03:40:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:40:29 INFO - '_': '/tools/buildbot/bin/python'} 03:40:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:40:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:40:29 INFO - Running setup.py (path:/tmp/pip-5B0mMc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:40:29 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 03:40:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:40:29 INFO - Running setup.py (path:/tmp/pip-aukNgO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:40:29 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)) 03:40:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:40:29 INFO - Running setup.py (path:/tmp/pip-y_Iwtb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:40:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 03:40:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:40:29 INFO - Running setup.py (path:/tmp/pip-OK6939-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:40:29 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)) 03:40:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:40:29 INFO - Running setup.py (path:/tmp/pip-QVN4pK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:40:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 03:40:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:40:29 INFO - Running setup.py (path:/tmp/pip-FW5dL3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:40:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 03:40:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:40:30 INFO - Running setup.py (path:/tmp/pip-4cs3SH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:40:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 03:40:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:40:30 INFO - Running setup.py (path:/tmp/pip-sTYBCo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:40:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 03:40:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:40:30 INFO - Running setup.py (path:/tmp/pip-Ha1StB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:40:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 03:40:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:40:30 INFO - Running setup.py (path:/tmp/pip-LVKwzj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:40:30 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)) 03:40:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:40:30 INFO - Running setup.py (path:/tmp/pip-2cVSKS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:40:30 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 03:40:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:40:30 INFO - Running setup.py (path:/tmp/pip-rLZGwT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:40:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 03:40:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:40:30 INFO - Running setup.py (path:/tmp/pip-gkhnXE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:40:30 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)) 03:40:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:40:30 INFO - Running setup.py (path:/tmp/pip-qAdSLu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:40:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 03:40:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:40:30 INFO - Running setup.py (path:/tmp/pip-pZbZ6G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:40:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 03:40:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:40:30 INFO - Running setup.py (path:/tmp/pip-fIuGMY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:40:30 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 03:40:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:40:30 INFO - Running setup.py (path:/tmp/pip-lauz59-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:40:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 03:40:30 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)) 03:40:30 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)) 03:40:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 03:40:30 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)) 03:40:30 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)) 03:40:30 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:40:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:32 INFO - Downloading blessings-1.6.tar.gz 03:40:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:40:32 INFO - Installing collected packages: blessings 03:40:32 INFO - Running setup.py install for blessings 03:40:32 INFO - Successfully installed blessings 03:40:32 INFO - Cleaning up... 03:40:32 INFO - Return code: 0 03:40:32 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:40:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:40:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:40:33 INFO - Reading from file tmpfile_stdout 03:40:33 INFO - Current package versions: 03:40:33 INFO - argparse == 1.2.1 03:40:33 INFO - blessings == 1.6 03:40:33 INFO - blobuploader == 1.2.4 03:40:33 INFO - docopt == 0.6.1 03:40:33 INFO - manifestparser == 1.1 03:40:33 INFO - mozInstall == 1.12 03:40:33 INFO - mozcrash == 0.17 03:40:33 INFO - mozdebug == 0.1 03:40:33 INFO - mozdevice == 0.48 03:40:33 INFO - mozfile == 1.2 03:40:33 INFO - mozhttpd == 0.7 03:40:33 INFO - mozinfo == 0.9 03:40:33 INFO - mozleak == 0.1 03:40:33 INFO - mozlog == 3.1 03:40:33 INFO - moznetwork == 0.27 03:40:33 INFO - mozprocess == 0.22 03:40:33 INFO - mozprofile == 0.28 03:40:33 INFO - mozrunner == 6.11 03:40:33 INFO - mozscreenshot == 0.1 03:40:33 INFO - mozsystemmonitor == 0.0 03:40:33 INFO - moztest == 0.7 03:40:33 INFO - mozversion == 1.4 03:40:33 INFO - psutil == 3.1.1 03:40:33 INFO - requests == 1.2.3 03:40:33 INFO - wsgiref == 0.1.2 03:40:33 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:40:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:40:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:40:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:33 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 0x7f33a72abf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29f5410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a84160>, '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 0x2a85060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a854f0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', '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 03:40:33 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 03:40:33 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 03:40:33 INFO - Using env: {'DISPLAY': ':0', 03:40:33 INFO - 'HOME': '/home/cltbld', 03:40:33 INFO - 'LANG': 'en_US.UTF-8', 03:40:33 INFO - 'LANGUAGE': 'en_US:en', 03:40:33 INFO - 'LOGNAME': 'cltbld', 03:40:33 INFO - 'MAIL': '/var/mail/cltbld', 03:40:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:40:33 INFO - 'MOZ_NO_REMOTE': '1', 03:40:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:40:33 INFO - 'NO_EM_RESTART': '1', 03:40:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:40:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:40:33 INFO - 'PWD': '/builds/slave/test', 03:40:33 INFO - 'SHELL': '/bin/bash', 03:40:33 INFO - 'SHLVL': '1', 03:40:33 INFO - 'TERM': 'linux', 03:40:33 INFO - 'TMOUT': '86400', 03:40:33 INFO - 'USER': 'cltbld', 03:40:33 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', 03:40:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:40:33 INFO - '_': '/tools/buildbot/bin/python'} 03:40:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:40:33 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)) 03:40:33 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)) 03:40:33 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)) 03:40:33 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)) 03:40:33 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)) 03:40:33 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)) 03:40:33 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)) 03:40:33 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)) 03:40:33 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)) 03:40:33 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)) 03:40:33 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)) 03:40:33 INFO - Cleaning up... 03:40:33 INFO - Return code: 0 03:40:33 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:40:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:40:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:40:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:33 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 0x7f33a72abf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29f5410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a84160>, '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 0x2a85060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a854f0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', '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 03:40:33 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 03:40:33 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 03:40:33 INFO - Using env: {'DISPLAY': ':0', 03:40:33 INFO - 'HOME': '/home/cltbld', 03:40:33 INFO - 'LANG': 'en_US.UTF-8', 03:40:33 INFO - 'LANGUAGE': 'en_US:en', 03:40:33 INFO - 'LOGNAME': 'cltbld', 03:40:33 INFO - 'MAIL': '/var/mail/cltbld', 03:40:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:40:33 INFO - 'MOZ_NO_REMOTE': '1', 03:40:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:40:33 INFO - 'NO_EM_RESTART': '1', 03:40:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:40:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:40:33 INFO - 'PWD': '/builds/slave/test', 03:40:33 INFO - 'SHELL': '/bin/bash', 03:40:33 INFO - 'SHLVL': '1', 03:40:33 INFO - 'TERM': 'linux', 03:40:33 INFO - 'TMOUT': '86400', 03:40:33 INFO - 'USER': 'cltbld', 03:40:33 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', 03:40:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:40:33 INFO - '_': '/tools/buildbot/bin/python'} 03:40:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:40:33 INFO - Downloading/unpacking jsonschema 03:40: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 03:40: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 03:40: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 03:40: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 03:40: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 03:40: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 03:40:35 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:40:35 INFO - Downloading/unpacking functools32 (from jsonschema) 03:40:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:35 INFO - Downloading functools32-3.2.3-2.tar.gz 03:40:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:40:35 INFO - warning: no files found matching '*.txt' 03:40:35 INFO - no previously-included directories found matching 'build' 03:40:35 INFO - no previously-included directories found matching 'dist' 03:40:35 INFO - no previously-included directories found matching '.git*' 03:40:35 INFO - Installing collected packages: jsonschema, functools32 03:40:35 INFO - Running setup.py install for functools32 03:40:35 INFO - warning: no files found matching '*.txt' 03:40:35 INFO - no previously-included directories found matching 'build' 03:40:35 INFO - no previously-included directories found matching 'dist' 03:40:35 INFO - no previously-included directories found matching '.git*' 03:40:35 INFO - Successfully installed jsonschema functools32 03:40:35 INFO - Cleaning up... 03:40:35 INFO - Return code: 0 03:40:35 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 03:40:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:40:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:40:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:40:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f33a72abf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29288a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x29f5410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a84160>, '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 0x2a85060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a854f0>, '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': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', '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 03:40:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 03:40:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 03:40:35 INFO - Using env: {'DISPLAY': ':0', 03:40:35 INFO - 'HOME': '/home/cltbld', 03:40:35 INFO - 'LANG': 'en_US.UTF-8', 03:40:35 INFO - 'LANGUAGE': 'en_US:en', 03:40:35 INFO - 'LOGNAME': 'cltbld', 03:40:35 INFO - 'MAIL': '/var/mail/cltbld', 03:40:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:40:35 INFO - 'MOZ_NO_REMOTE': '1', 03:40:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:40:35 INFO - 'NO_EM_RESTART': '1', 03:40:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:40:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:40:35 INFO - 'PWD': '/builds/slave/test', 03:40:35 INFO - 'SHELL': '/bin/bash', 03:40:35 INFO - 'SHLVL': '1', 03:40:35 INFO - 'TERM': 'linux', 03:40:35 INFO - 'TMOUT': '86400', 03:40:35 INFO - 'USER': 'cltbld', 03:40:35 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', 03:40:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:40:35 INFO - '_': '/tools/buildbot/bin/python'} 03:40:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:40:36 INFO - Downloading/unpacking flake8 03:40:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:37 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 03:40:38 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 03:40:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:38 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 03:40:38 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 03:40:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:38 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 03:40:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:40:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:40:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:40:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 03:40:38 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:40:38 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:40:38 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:40:38 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:40:38 INFO - no previously-included directories found matching 'docs/_build' 03:40:38 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 03:40:38 INFO - Running setup.py install for pep8 03:40:39 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:40:39 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:40:39 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:40:39 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:40:39 INFO - no previously-included directories found matching 'docs/_build' 03:40:39 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 03:40:39 INFO - Successfully installed flake8 mccabe pyflakes pep8 03:40:39 INFO - Cleaning up... 03:40:39 INFO - Return code: 0 03:40:39 INFO - Running post-action listener: _resource_record_post_action 03:40:39 INFO - Running post-action listener: _start_resource_monitoring 03:40:39 INFO - Starting resource monitoring. 03:40:39 INFO - ##### 03:40:39 INFO - ##### Running install step. 03:40:39 INFO - ##### 03:40:39 INFO - Running pre-action listener: _resource_record_pre_action 03:40:39 INFO - Running main action method: install 03:40:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:40:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:40:39 INFO - Reading from file tmpfile_stdout 03:40:39 INFO - Detecting whether we're running mozinstall >=1.0... 03:40:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:40:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:40:39 INFO - Reading from file tmpfile_stdout 03:40:39 INFO - Output received: 03:40:39 INFO - Usage: mozinstall [options] installer 03:40:39 INFO - Options: 03:40:39 INFO - -h, --help show this help message and exit 03:40:39 INFO - -d DEST, --destination=DEST 03:40:39 INFO - Directory to install application into. [default: 03:40:39 INFO - "/builds/slave/test"] 03:40:39 INFO - --app=APP Application being installed. [default: firefox] 03:40:39 INFO - mkdir: /builds/slave/test/build/application 03:40:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 03:40:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 03:40:55 INFO - Reading from file tmpfile_stdout 03:40:55 INFO - Output received: 03:40:55 INFO - /builds/slave/test/build/application/firefox/firefox 03:40:55 INFO - Running post-action listener: _resource_record_post_action 03:40:55 INFO - ##### 03:40:55 INFO - ##### Running run-tests step. 03:40:55 INFO - ##### 03:40:55 INFO - Running pre-action listener: _resource_record_pre_action 03:40:55 INFO - Running main action method: run_tests 03:40:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:40:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:40:55 INFO - Python 2.7.3 03:40:55 INFO - Return code: 0 03:40:55 INFO - grabbing minidump binary from tooltool 03:40:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:40:55 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 0x2a84160>, '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 0x2a85060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a854f0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:40:55 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 03:40:55 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 03:40:55 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:40:55 INFO - Return code: 0 03:40:55 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 03:40:55 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:40:55 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:40:55 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 03:40:55 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:40:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 03:40:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 03:40:56 INFO - Return code: 0 03:40:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-030', '--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 03:40:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-030 --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 03:40:56 INFO - Using env: {'DISPLAY': ':0', 03:40:56 INFO - 'HOME': '/home/cltbld', 03:40:56 INFO - 'LANG': 'en_US.UTF-8', 03:40:56 INFO - 'LANGUAGE': 'en_US:en', 03:40:56 INFO - 'LOGNAME': 'cltbld', 03:40:56 INFO - 'MAIL': '/var/mail/cltbld', 03:40:56 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:40:56 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:40:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:40:56 INFO - 'MOZ_NO_REMOTE': '1', 03:40:56 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:40:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:40:56 INFO - 'NO_EM_RESTART': '1', 03:40:56 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:40:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:40:56 INFO - 'PWD': '/builds/slave/test', 03:40:56 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:40:56 INFO - 'SHELL': '/bin/bash', 03:40:56 INFO - 'SHLVL': '1', 03:40:56 INFO - 'TERM': 'linux', 03:40:56 INFO - 'TMOUT': '86400', 03:40:56 INFO - 'USER': 'cltbld', 03:40:56 INFO - 'XDG_SESSION_COOKIE': '4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773', 03:40:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:40:56 INFO - '_': '/tools/buildbot/bin/python'} 03:40:56 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-030', '--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 03:40:56 INFO - mozversion application_buildid: 20160425062348 03:40:56 INFO - mozversion application_changeset: 8551b253f4061db31e4be7829c2f70c2610caf42 03:40:56 INFO - mozversion application_display_name: FirefoxDeveloperEdition 03:40:56 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:40:56 INFO - mozversion application_name: Firefox 03:40:56 INFO - mozversion application_remotingname: firefox-dev 03:40:56 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 03:40:56 INFO - mozversion application_vendor: Mozilla 03:40:56 INFO - mozversion application_version: 47.0a2 03:40:56 INFO - mozversion platform_buildid: 20160425062348 03:40:56 INFO - mozversion platform_changeset: 8551b253f4061db31e4be7829c2f70c2610caf42 03:40:56 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 03:40:56 INFO - mozversion platform_version: 47.0a2 03:40:56 INFO - using testdate: 1461753656 03:40:56 INFO - actual date: 1461753656 03:40:56 INFO - starting webserver on 'localhost:58837' 03:40:56 INFO - SUITE-START | Running 2 tests 03:40:56 INFO - TEST-START | dromaeo_css 03:40:56 INFO - operating with platform_type : linux_ 03:40:56 INFO - Initialising browser for dromaeo_css test... 03:40:56 INFO - TEST-INFO | started process 1951 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpDyCgSh/profile http://localhost:58837/getInfo.html) 03:41:00 INFO - PROCESS | 1951 | __metrics Screen width/height:1600/1200 03:41:00 INFO - PROCESS | 1951 | colorDepth:24 03:41:00 INFO - PROCESS | 1951 | Browser inner width/height: 1024/697 03:41:00 INFO - PROCESS | 1951 | __metrics 03:41:01 INFO - PROCESS | 1951 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:41:01 INFO - TEST-INFO | 1951: exit 0 03:41:01 INFO - Browser initialized. 03:41:01 INFO - Running cycle 1/1 for dromaeo_css test... 03:41:01 INFO - TEST-INFO | started process 2042 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpDyCgSh/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:41:13 INFO - PROCESS | 2042 | RSS: Main: 141737984 03:41:13 INFO - PROCESS | 2042 | 03:42:05 INFO - PROCESS | 2042 | 1461753725004 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 03:44:13 INFO - PROCESS | 2042 | Cycle 1(1): loaded http://localhost:58837/tests/dromaeo/cssquery-dojo.html (next: http://localhost:58837/tests/dromaeo/cssquery-ext.html) 03:44:14 INFO - PROCESS | 2042 | RSS: Main: 256409600 03:44:14 INFO - PROCESS | 2042 | 03:47:16 INFO - PROCESS | 2042 | Cycle 1(1): loaded http://localhost:58837/tests/dromaeo/cssquery-ext.html (next: http://localhost:58837/tests/dromaeo/cssquery-jquery.html) 03:47:16 INFO - PROCESS | 2042 | RSS: Main: 228700160 03:47:16 INFO - PROCESS | 2042 | 03:50:18 INFO - PROCESS | 2042 | Cycle 1(1): loaded http://localhost:58837/tests/dromaeo/cssquery-jquery.html (next: http://localhost:58837/tests/dromaeo/cssquery-mootools.html) 03:50:19 INFO - PROCESS | 2042 | RSS: Main: 220921856 03:50:19 INFO - PROCESS | 2042 | 03:53:21 INFO - PROCESS | 2042 | Cycle 1(1): loaded http://localhost:58837/tests/dromaeo/cssquery-mootools.html (next: http://localhost:58837/tests/dromaeo/cssquery-prototype.html) 03:53:21 INFO - PROCESS | 2042 | RSS: Main: 184664064 03:53:21 INFO - PROCESS | 2042 | 03:56:24 INFO - PROCESS | 2042 | Cycle 1(1): loaded http://localhost:58837/tests/dromaeo/cssquery-prototype.html (next: http://localhost:58837/tests/dromaeo/cssquery-yui.html) 03:56:24 INFO - PROCESS | 2042 | RSS: Main: 207863808 03:56:24 INFO - PROCESS | 2042 | 03:59:27 INFO - PROCESS | 2042 | Cycle 1(1): loaded http://localhost:58837/tests/dromaeo/cssquery-yui.html (next: http://localhost:58837/tests/dromaeo/cssquery-dojo.html) 03:59:27 INFO - PROCESS | 2042 | RSS: Main: 256360448 03:59:27 INFO - PROCESS | 2042 | 03:59:27 INFO - PROCESS | 2042 | __start_tp_report 03:59:27 INFO - PROCESS | 2042 | _x_x_mozilla_page_load 03:59:27 INFO - PROCESS | 2042 | _x_x_mozilla_page_load_details 03:59:27 INFO - PROCESS | 2042 | |i|pagename|runs| 03:59:27 INFO - PROCESS | 2042 | |0;dojo.html;3297.3240485700435;3349.8492567834446;3363.495475678649;3370.5618269624947;3395.1342407686043;5485.149801780725;5485.369182544008;5489.752961116749;5492.121260598305;5503.20203570482;5452.482014208654;5462.20797984292;5469.781208751655;5484.314460692413;5488.094464413377;4781.976090119544;4977.975110124445;5024.371953505812;5047.293378926953;5096.337476128117;4962.851114466572;4972.25416187573;5002.12462819007;5044.445111037783;5102.081625307444;5062;5086.821961231358;5092.159793634046;5092.643514953955;5109.6678715883345;4834.564889159958;5014.398272207322;5019.498050194988;5070.822521211759;5083.898322033557;4940.604751619861;4995.325631039799;5004.224345226496;5007.974960125176;5047.2429135629945;5352.678839269656;5360.678359298455;5373.032854086263;5401.4868587484125;5418.566514678816;5774.855628609276;5853;5928.170056192136;5931.703414829241;5938.346781853993;5889.617174883661;5899.262592175978;5909.4090590941;5932.762689492415;5948.643081415085;5515.834524964257;5520.089185284463;5521.116621340607;5523.143912693498;5526.696031718294;5928.466438020599;6005.669688167105;6034.155218269446;6044.9395506044375;6115.4190351916495;5751.424857514216;5753.482186603226;5755.280589926259;5756.5682573807135;5790.88418231633;5817;5850.268716410449;5851.531877449794;5851.824445266649;5858.970705146447;5786.132080188006;5826.388229235954;5882.499987501024;6003.339632640406;6016.1878146450545;5823.82528524145;5841.795537156264;5864.354920958691;5867.178594996704;5876.588638795243;4464.4865840428765;4480.260756975128;4484.237679594412;4490.012197316585;4511.233090374644;3919.431682406035;4011.5587285398583;4064.1871625674985;4072.511298644182;4110.547839737626;5542.418046105182;5584.078627026576;5594.608377413542;5600.215969764236;5609.803656872072;5801.796937107181;5928.703564821742;5945.762169513171;5947.672877991666;5948.286205655262;5521.337439507204;5549.334079910436;5570.832875013756;5613;5632.211490391349;5059.2916991621205;5065.366829146356;5069.670471419346;5071.746412679351;5107.795688172431;6011.308699499614;6036.456718895321;6059.515238780887;6064.969675151596;6071.423214794588;5968.313643931004;5987.072003839412;6001.90997135052;6002.639841609517;6009.669468179292;6091.725872335667;6101.725422356093;6103.786367477117;6111.84720381994;6143.662098584621;5627.915581266366;5740;5790;5896.557758168069;5914.408559144051;5934.19888315072;5970.3432622412365;5971.970140149445;5981.52147828164;5983.431574000463;5787.797427090031;5808.912866307093;5812.738426770721;5813.534917206529;5817.70911454434;5621.634593751393;5662.292213473316;5734.684592347461;5765.682887441231;5776.075827867521;5662;5665.291838520185;5689.829305120853;5694.974904517227;5698;5822.679752613478;5830.47525722687;5843.649381036981;5866.853328666647;5868.501177399969;5592.748326325243;5627.718614069198;5628.493435590816;5691.231683722644;5727.770889164387 03:59:27 INFO - PROCESS | 2042 | |1;ext.html;552.8061741009836;561.2086957390078;572.6850232372195;580.1703563903616;590.8050343386683;38227.23545529088;38635.420468692995;38649;38682.61317386829;38798.806005969964;41788;42503.36244956328;42557.7872110639;42578.36132458008;42583.574164258345;8685.218330350268;8877.378583499125;8879.245264152523;8880.24517915978;8880.422772519765;8702.695405660803;8837.072107428723;8842.248408885253;8959.193672569467;8992.23565996891;8946.060663630322;9028.909710902906;9029.458232506038;9032.909670903306;9045.276377889786;8996.8650470243;9064.410813297114;9069.727908162766;9080.318976076755;9088.863667045;9130.771730706785;9255.768605784842;9277.814443711088;9281.21109705676;9282.396644218104;41632.75101746953;42078.36882446766;42106.789466052476;42165.57834421647;42211.36682949758;3774.9245015099546;3830.80845957701;4043.2317859606583;4074.7555146691293;4488.236999710057;32845.34309313824;33064.3387132256;33112.17219569506;33246.168845778804;34543.827280863436;3628.2743451309843;3697.8335974881193;3705.1478160023075;3742.438634204891;3763.040424691686;288384;289941;291376;292418.99999999785;293472;45604.54395456069;46155.615216554375;46293;62660.686696567136;62915;43801.342979855326;43888;43942.780286098365;43951.560484395384;44066.779666101465;15907.840921590867;16055.598610034609;16066.437674681563;16081.195940202942;16082.276297566403;12718.364081795873;12724.809127863089;12757.936210318889;12759.043071769654;12776.680582985315;15513.146776927377;15543.922280388526;15646;15667.216639168224;15689.921550392175;5824.271966004249;5847.1229315603;5862.179294898718;6020.8795824084145;6034.547408944259;1134.9943250283861;1143.8398624192619;1154.722866512031;1174.1252766688872;1222.4498975461079;29068.27329316784;29442.558361624593;29693.703062969525;29941.700582994326;30428.84785576058;1103.6578660615235;1140.2417392434104;1163.3834067944003;1203.9337836419081;1226.3255209634845;15725;15732.528024159294;15978.76031859523;16045.518634440985;16134.034452937694;326106;329171;329224;329341;331247;56833.43166568364;57593.272201834014;57730.42269577335;57741;57928.420715793145;1348.3932230496316;1456.8543145685346;1465.4577806211769;1499.9400023999135;1507.796447479598;29036.7096329034;29467.85266073656;29555.261118472212;30064.849675752357;30290.24274393158;45802.77098614485;46808.76595617;46832.42421666841;46874.296885546064;46912;224437;228078;229154;229823;229893;30302.090937271918;34784.47823282602;34881;34918.65081349255;35451.46822797608;42293;44119.77940110279;50913;51504.48495514997;52094;40454.39318410285;41165.382519261635;41445.378319325835;41961.160776784905;42473.57526424696;40008.3998740025;41649.79175104105;41788;41864.372034420114;41932.16135677331;39622.60377396304;40582;40687.79656101701;41488.37767433551;41713.37429938614;36663;36705.26589468249;36823.63176368309;37745;38018.429723553614;25970.74029259683;26043.218703438928;26702.866485667448;26769.86615066912;26980.73019269782 03:59:27 INFO - PROCESS | 2042 | |2;jquery.html;377.9584245732969;386.8239950822373;390.98045097745114;394.94470774091633;395.274670978754;16996.915015424922;18689.4393168205;18936.810631893677;19086.04569771513;19129.139188736506;11907.702307442318;17874.910625446886;18617.16222769975;18628.72056919147;18629.161687724052;5077.923831142536;5201.635885488017;5230.372355317368;5239.240310155025;5247.317848679666;4112;5718.399568045358;5928.644281343111;5948.7620495180145;5951.9107213391835;5642.858928526799;5911.408859114097;5914.792982245623;5931.051031834907;5947.286325640929;5737.168110623957;5740;5774.797882074149;5788.479036886701;5824.417558244184;3961.98019009906;5421.268128802601;5642.069058605325;5652.9152062719095;5654.491095801356;13582.728345433135;13588.93205533966;13591.660208494768;20001.599968000704;22206.333809985725;2298.069281940817;2300.1719381022817;2374.643803429482;2390.2829151254728;2936.985315073411;13375.665608359868;14679.266036698122;14853.405863765436;15534;15536.922315388463;1999.9100040498067;2046.7339245898088;2049.3749406431034;2058.3927741316197;2071.0887209627717;70472.647636762;73378;73649.6317518409;73970;75706.62146689286;15175.620609484631;15567.377304907677;15762.369505219664;15922.920385397998;16117.355305787873;26664.20007399781;26880.462390752076;27070.05254816072;27093.593596096074;27263.182104536896;9266.166045055978;9475.241980641533;9529.714108576754;9644.18024467914;9679.612815487442;8111.026676798822;8157.877631835528;8174.3460523158;8273.669053237923;8387.161283871565;8146.389020823462;8160.97987751531;8186.877196842052;8212;8368.995720513578;2480.9751902481107;2954.4091181763733;3128.8592013359;3171.7938334008218;3351.9664803352143;994.2493417469908;1020.1685626214611;1036.036486067949;1041.4844651897208;1060.5798034312907;16943.661126777642;17225.65548689019;17263.827361726475;17510;17966.820331796775;982.626601891291;992.8858181309242;999.8050380175941;1016.3241444439512;1019.6788011776267;9836.06557377048;10082.59669613222;10115.381538953732;10123.696289111338;10178.033086856736;456082;461508;466917;473488;474995;70589.64705176442;71713.28286717067;72217.6389118051;72878.2712172882;72901;1026.4098143567478;1035.2649618770756;1038.7299302181486;1048.5910494906993;1078.191356482638;15588.270449022;15681.215939202766;15724.528264152093;15725.370985160465;15868;33308.500372493945;33471.16322091967;33759.4680398976;33998.8300058508;34431.65568344285;47296;47347;47397.052058959314;47521.762391187825;48314;8422.494650321001;8493.362997775068;8495.575221239036;8496.192861678132;8564.057953624972;9620.860630438634;13086.607401777961;13222.47110115623;13430.529931452744;13552.93223533876;11098.167637427387;11393.487293071666;11551.537938482366;11574.421278935852;11733.88266117362;11246.606368777053;11356.205065645325;11368.886311136783;11528.789477104783;11581.420928953687;11378;11564.94217528907;11588.594399195988;11768.117391195865;11970.521179152736;8230.753077407688;8328.708495202638;8363.540005299767;8507.489550626982;8573.442726223026;11222.775544489228;11432.542698291974;11575.652730418102;11703.531858725555;11848.940755296167 03:59:27 INFO - PROCESS | 2042 | |3;mootools.html;1406.7678832992556;1573.3234709075098;1575.7951466309378;1839.9724004139932;1932.2077948041306;7983.08194557626;8175.427720059583;8186;8190.221928916743;8193.549354785484;7802.375809935205;7918.485298455596;7938.087119981204;7938.682452701885;7943.165967573408;2094.2042024030848;2132.4455641533236;2356.8114550835935;2380.6191009438494;2387.415083304593;2442.4504486490487;2449.5835707929696;2450.76717711818;2452.2520631207476;2452.460458699092;2354.152505098163;2404.615261558151;2454.472288457981;2456.250843492734;2457.533068716947;2370.3126093432884;2397.6283676030157;2405.5549723301247;2408.638704194367;2410.313060777679;2355.599548076831;2383.7377888432256;2386.140989243871;2386.868722220277;2410.288964755401;8537.103604121601;8559.27246184075;8568.186022327869;8590.484570925702;8598.4840909545;5141;5262.05283049051;5263.526282634582;5263.552598029172;5265.183896496049;3280.7703460757757;3307.1732066983254;3319.7842140260805;3380.594328680574;3381.830908454592;1096.1888202730001;1105.2981356838386;1109.8002359575273;1174.3364998775664;1178.0810967445407;11764.882351176464;11787.587434439753;11787.88212117885;11800.822987655107;11836.704082397922;4493.326001099861;4517.548245175456;4589.036302376471;4599.034202817379;4619.214733495314;10119.797604048024;10134.746631334276;10138.03688649577;10145.847812282822;10157.441340726331;5066.341375621146;5075.289459475676;5081.441041485434;5104;5120.564751996122;4075.572064933199;4597.678162528658;4685.1098291325225;4696.483386827446;4698.553637404441;3868.361720316116;3948.230095131479;3974.8608798691907;3980.681545476355;4020.557738648746;1285.5500574798746;1296.0409297120063;1299.753046921082;1305.595265467708;1316.1116246533743;1178.2105988987398;1195.4321697193936;1402.8877689784792;1467.801846750675;1497.1316636350891;8161.714339998071;8192.18078192188;8194.385421093442;8212.260896519341;8216.383771217183;552.8562573730778;560.3639868749;566.8469513231404;567.9261695979496;573.2175580332815;6025.186599809057;6139.508839292936;6156.661383623854;6164.198654174928;6205.069239614094;10126.088652021206;10552.99746524079;10605.045545900906;10653.520591573399;10655.786884262272;9959.551820167964;10262.025107614765;10362.481875906175;10365.585376584851;10453;8077.27304542594;8160.3471722262075;8164.591770411455;8225.629846657035;8285.917140828515;7520.059992500937;7595.658195381111;7624.504407213513;7803.531788092732;7809.062912450542;9177.816443671223;9177.862332064891;9315.301352398732;9380.202682771767;9418.199453046567;9411.247100231829;9607.087326703951;9607.279454040836;9780.315377923476;9782.266330025133;6734.764283250062;7076.646167691698;7209.4592905533345;7623.275788800055;7673.53958762476;7931.524108553505;7949.682012719427;7984.600769961595;7985.361171106414;8000.959995199987;7122.8219294515975;7185.353318201387;7256.528325658815;7278.163011253562;7428.1086269647985;6966.12923384577;7138.072050633385;7178.748743793943;7269;7280.9271907280245;7342.192358840416;7486.326230639269;7499.925000749922;7509.136449308181;7512.586807725409;6866.896996545156;6919.169699636076;6921.065656136358;6939.375456208965;6939.444844412334;6917.896231556631;7095.503314767917;7129.536580122275;7132.928670713226;7146.428285737233 03:59:27 INFO - PROCESS | 2042 | |4;prototype.html;360.90255630979635;364.49881413057045;367.78300802526513;370.13388670511;374.04804771855623;6000.75996960121;6007.879842403149;6007.969960150199;6017.699115044246;6027.849303767408;5965.552583556239;5967.791127310545;5969.194158788562;5971.970140149304;5974.581779275452;4487.887802804939;4581.152486789938;4675.8363457279;4699.553542413474;4729.2433210686295;4686.765661716918;4687.554682305193;4708.929366059512;4714.929276060861;4714.976425117869;4646.605038571709;4649.163150632885;4650.325702773096;4652.697574657636;4665.300204969265;4445;4539.818407263722;4621.907561848744;4650.372199753024;4671.906561868777;4107.794610269475;4110.23960567296;4115.650169735576;4133.91732165358;4139.21354942563;5673.120666296731;5673.574481913873;5679.176519404705;5681.602287839853;5684.886302273972;5430.59270554706;5439.945600543983;5444.537214336786;5447.836564903059;5449.99175152594;6289.213848268966;6298;6301.87396252077;6302.149209856657;6308.400701933309;4341.110072435144;4474.306482495218;4493.9101217975785;4502.8198872045405;4593.678442509025;6524.314946930599;6596.571222870498;6597.274299827015;6602.60384376939;6608.834779130512;4572.942176020738;4584.701994370355;4601.263797792337;4611.262198048296;4611.654125940568;4665.2302370108555;4673.369095172108;4679.555442232982;4680.297955306732;4682.765861706901;5335.039692855324;5343.3587969443915;5350.946490535122;5355.527230011778;5355.839324820262;6239.937600623935;6352.745890164434;6353.5870168438905;6366.140571022946;6388.329225431356;1618.765279034557;1631.078440681035;1639.7868277123898;1642.3348543839763;1647.1928754910007;1035.5081336365317;1062.511244827388;1080.9135269178446;1101.9063379612662;1108.4014632098738;6010.549208809357;6015.518758499309;6018.548608854353;6019.729112189962;6036.788712395045;6392.840178995562;6475.158229430144;6509.804705858832;6510.121133646897;6513.511486638521;6102.359252278447;6102.755889764359;6103.755849766048;6108.602940808833;6111.786087486917;3461.9653803462147;3495.8426870790877;3499.950014995491;3501.3697534444045;3506.1234691327168;6610.338966103352;6689.799306020827;6741.22475915276;6797.320267973262;6807.115075040213;6739.898901516482;6773.8645227095185;6781.796546103625;6784.694688739019;6787.728490860311;6822.317768223138;6831.146106736658;6840.760573379908;6844.452443804484;6851.143607049119;6586.077949087227;6604.348912771807;6609.636469994197;6619.040239165391;6624;6227.287495938653;6520.989246666774;6521;6537;6545.8690826184165;6790.626515541692;6828.726850926106;6831.726730930906;6831.9658401707675;6841.692123854339;4714.3399924011355;4761.047790441856;4766.285057241442;4770.403699537558;4771.403574553181;6534.8366290843105;6537.117489139096;6542.084108224947;6550.443212327005;6552.443042341264;6226.965828345788;6267.435930766253;6326.873462530815;6335.714892829926;6353.936460635335;6321.841953951188;6343.238811342484;6350.1109844622715;6351.2696039956;6360.141380913517;6123.2958209804665;6128.387161283836;6129.969350153221;6131.570790044654;6176.81469555914;6347.809565713036;6360.968195158995;6365.586236894587;6370.203724534434;6383.968080159755;5992.550558708027;6085.3306136325855;6112.144299797943;6208.379162083756;6219.813405597839 03:59:27 INFO - PROCESS | 2042 | |5;yui.html;795.4431897671632;797.968081276749;799.2766546275623;802.5545822068751;818.8321394114205;13001.284929328884;15276.770848437282;15589.844101558981;15595;15603.063816171038;14626.122432654049;14629.634259143526;14638.926805365958;14670.853291467081;14679.853201467982;778.8481246157002;908.4776253654159;916.0976438208393;932.5570354081825;938.8920274168455;928.5450129436562;931.8229536388098;932.7061975477736;933.3140141995627;934.2666007184328;806.7620052084649;968.4383057826444;968.4479846487505;974.9756256093583;975.8828940527146;925.5002298758662;946.186279799372;947.1854205383399;947.5641205045653;948.4262021476976;694.6873906741986;694.9548279361825;695.5965539986795;695.7495301691387;696.6168607266034;13658.248796316198;13763.036587438883;13788.586342409744;13790.931045344809;13797.034207605471;11693.766124677544;12117.878821211763;12154.088443366783;12302.630921072383;12312.26126432417;9728.270379721549;9858.802823943553;9897.109260166548;9986.450745209011;10034.89965100347;3366.7138293245102;3387.120947194889;3407.454807230831;3414.2488652496413;3520.2255503789124;50781.492185078416;50882.745586271834;50926;51053.99999999963;51232;8743;9137.77155571116;9147.993720690718;9275.907240927505;9288.396254243453;18284.725729114074;18290.902545847293;18473.1687074082;18480.168392422373;18549.35077272289;7061.540999834994;7253.818654533573;7283.380912622486;7356.227596102439;7460.3658689012045;4112.239235741397;4132.297509423405;4168.478940132483;4196.328587426058;4273.893152671208;3123.593932788723;3296.7197788188273;3328.6504916983854;3338.849751761177;3342.0308110648125;585.9560532960045;643.4594940250118;653.7254353171679;665.4077870695086;682.0791930893255;619.5972617798377;633.0567454492865;681.3799442507294;684.3498676257575;708.0936401406208;8479.660813567512;8572.099929507436;8636.697715579925;8645.394822362374;8664.393492455467;609.5611159964818;665.1818263535781;697.5675081449432;711;747.4020783373388;4001.2197621463533;4021.1153546219784;4041.211963667057;4153.646940010072;4172.436721042621;57186.42813571811;57302.7134864323;57533.42466575364;57682.7115864418;57973.710131449916;49519;50137.498625014014;50297.24554131691;51066.744666276434;51167.97664046698;40269.39595906064;40458;40753.38869916953;40910.18179636331;41202;8537.82924341522;8566.314694824274;8616.310695144248;8702.564871756513;8713.91286087131;32342.35315293728;33117.83441082779;33381.83309083536;33657;34125.31749365049;40670.59329406668;40719.59280407277;44316;45368.546314536434;46123.76938115288;11765.176437649625;11978.820317695066;12057.939710301393;12089.15375923677;12159.270443773048;12736.554220602606;12996.350182491027;13064;13435.462581496631;13727.794083088562;11765.823512647146;11817.586384476503;11987.460564274454;12008.60180717793;12211.328376938998;11778.646640600795;11970.521179152736;12185.207961482476;12188.390580471118;12297;10868.891311086787;11113.555457781922;11166.720831979266;11329.546818127183;11377.203595748219;9704.514774261117;9903.851442228517;9948.104670579683;10131.594736210469;10159.898401015895;9834.655787047419;10147.441890696082;10163.288569800043;10197.23520735933;10253.436061016715 03:59:27 INFO - PROCESS | 2042 | __end_tp_report 03:59:27 INFO - PROCESS | 2042 | __start_cc_report 03:59:27 INFO - PROCESS | 2042 | _x_x_mozilla_cycle_collect,891 03:59:27 INFO - PROCESS | 2042 | __end_cc_report 03:59:27 INFO - PROCESS | 2042 | __startTimestamp1461754767267__endTimestamp 03:59:27 INFO - PROCESS | 2042 | 03:59:27 INFO - PROCESS | 2042 | ------- Summary: start ------- 03:59:27 INFO - PROCESS | 2042 | Number of tests: 6 03:59:27 INFO - PROCESS | 2042 | 03:59:27 INFO - PROCESS | 2042 | [#0] dojo.html Cycles:165 Average:5478.76 Median:5665.29 stddev:604.59 (10.7%) stddev-sans-first:581.72 03:59:27 INFO - PROCESS | 2042 | Values: 3297.3 3349.8 3363.5 3370.6 3395.1 5485.1 5485.4 5489.8 5492.1 5503.2 5452.5 5462.2 5469.8 5484.3 5488.1 4782.0 4978.0 5024.4 5047.3 5096.3 4962.9 4972.3 5002.1 5044.4 5102.1 5062.0 5086.8 5092.2 5092.6 5109.7 4834.6 5014.4 5019.5 5070.8 5083.9 4940.6 4995.3 5004.2 5008.0 5047.2 5352.7 5360.7 5373.0 5401.5 5418.6 5774.9 5853.0 5928.2 5931.7 5938.3 5889.6 5899.3 5909.4 5932.8 5948.6 5515.8 5520.1 5521.1 5523.1 5526.7 5928.5 6005.7 6034.2 6044.9 6115.4 5751.4 5753.5 5755.3 5756.6 5790.9 5817.0 5850.3 5851.5 5851.8 5859.0 5786.1 5826.4 5882.5 6003.3 6016.2 5823.8 5841.8 5864.4 5867.2 5876.6 4464.5 4480.3 4484.2 4490.0 4511.2 3919.4 4011.6 4064.2 4072.5 4110.5 5542.4 5584.1 5594.6 5600.2 5609.8 5801.8 5928.7 5945.8 5947.7 5948.3 5521.3 5549.3 5570.8 5613.0 5632.2 5059.3 5065.4 5069.7 5071.7 5107.8 6011.3 6036.5 6059.5 6065.0 6071.4 5968.3 5987.1 6001.9 6002.6 6009.7 6091.7 6101.7 6103.8 6111.8 6143.7 5627.9 5740.0 5790.0 5896.6 5914.4 5934.2 5970.3 5972.0 5981.5 5983.4 5787.8 5808.9 5812.7 5813.5 5817.7 5621.6 5662.3 5734.7 5765.7 5776.1 5662.0 5665.3 5689.8 5695.0 5698.0 5822.7 5830.5 5843.6 5866.9 5868.5 5592.7 5627.7 5628.5 5691.2 5727.8 03:59:27 INFO - PROCESS | 2042 | 03:59:27 INFO - PROCESS | 2042 | [#1] ext.html Cycles:180 Average:46060.10 Median:38740.71 stddev:74563.53 (192.5%) stddev-sans-first:74694.41 03:59:27 INFO - PROCESS | 2042 | Values: 552.8 561.2 572.7 580.2 590.8 38227.2 38635.4 38649.0 38682.6 38798.8 41788.0 42503.4 42557.8 42578.4 42583.6 8685.2 8877.4 8879.2 8880.2 8880.4 8702.7 8837.1 8842.2 8959.2 8992.2 8946.1 9028.9 9029.5 9032.9 9045.3 8996.9 9064.4 9069.7 9080.3 9088.9 9130.8 9255.8 9277.8 9281.2 9282.4 41632.8 42078.4 42106.8 42165.6 42211.4 3774.9 3830.8 4043.2 4074.8 4488.2 32845.3 33064.3 33112.2 33246.2 34543.8 3628.3 3697.8 3705.1 3742.4 3763.0 288384.0 289941.0 291376.0 292419.0 293472.0 45604.5 46155.6 46293.0 62660.7 62915.0 43801.3 43888.0 43942.8 43951.6 44066.8 15907.8 16055.6 16066.4 16081.2 16082.3 12718.4 12724.8 12757.9 12759.0 12776.7 15513.1 15543.9 15646.0 15667.2 15689.9 5824.3 5847.1 5862.2 6020.9 6034.5 1135.0 1143.8 1154.7 1174.1 1222.4 29068.3 29442.6 29693.7 29941.7 30428.8 1103.7 1140.2 1163.4 1203.9 1226.3 15725.0 15732.5 15978.8 16045.5 16134.0 326106.0 329171.0 329224.0 329341.0 331247.0 56833.4 57593.3 57730.4 57741.0 57928.4 1348.4 1456.9 1465.5 1499.9 1507.8 29036.7 29467.9 29555.3 30064.8 30290.2 45802.8 46808.8 46832.4 46874.3 46912.0 224437.0 228078.0 229154.0 229823.0 229893.0 30302.1 34784.5 34881.0 34918.7 35451.5 42293.0 44119.8 50913.0 51504.5 52094.0 40454.4 41165.4 41445.4 41961.2 42473.6 40008.4 41649.8 41788.0 41864.4 41932.2 39622.6 40582.0 40687.8 41488.4 41713.4 36663.0 36705.3 36823.6 37745.0 38018.4 25970.7 26043.2 26702.9 26769.9 26980.7 03:59:27 INFO - PROCESS | 2042 | 03:59:27 INFO - PROCESS | 2042 | [#2] jquery.html Cycles:180 Average:27405.06 Median:3041.63 stddev:76359.25 (2510.5%) stddev-sans-first:76546.50 03:59:27 INFO - PROCESS | 2042 | Values: 378.0 386.8 391.0 394.9 395.3 16996.9 18689.4 18936.8 19086.0 19129.1 11907.7 17874.9 18617.2 18628.7 18629.2 5077.9 5201.6 5230.4 5239.2 5247.3 4112.0 5718.4 5928.6 5948.8 5951.9 5642.9 5911.4 5914.8 5931.1 5947.3 5737.2 5740.0 5774.8 5788.5 5824.4 3962.0 5421.3 5642.1 5652.9 5654.5 13582.7 13588.9 13591.7 20001.6 22206.3 2298.1 2300.2 2374.6 2390.3 2937.0 13375.7 14679.3 14853.4 15534.0 15536.9 1999.9 2046.7 2049.4 2058.4 2071.1 70472.6 73378.0 73649.6 73970.0 75706.6 15175.6 15567.4 15762.4 15922.9 16117.4 26664.2 26880.5 27070.1 27093.6 27263.2 9266.2 9475.2 9529.7 9644.2 9679.6 8111.0 8157.9 8174.3 8273.7 8387.2 8146.4 8161.0 8186.9 8212.0 8369.0 2481.0 2954.4 3128.9 3171.8 3352.0 994.2 1020.2 1036.0 1041.5 1060.6 16943.7 17225.7 17263.8 17510.0 17966.8 982.6 992.9 999.8 1016.3 1019.7 9836.1 10082.6 10115.4 10123.7 10178.0 456082.0 461508.0 466917.0 473488.0 474995.0 70589.6 71713.3 72217.6 72878.3 72901.0 1026.4 1035.3 1038.7 1048.6 1078.2 15588.3 15681.2 15724.5 15725.4 15868.0 33308.5 33471.2 33759.5 33998.8 34431.7 47296.0 47347.0 47397.1 47521.8 48314.0 8422.5 8493.4 8495.6 8496.2 8564.1 9620.9 13086.6 13222.5 13430.5 13552.9 11098.2 11393.5 11551.5 11574.4 11733.9 11246.6 11356.2 11368.9 11528.8 11581.4 11378.0 11564.9 11588.6 11768.1 11970.5 8230.8 8328.7 8363.5 8507.5 8573.4 11222.8 11432.5 11575.7 11703.5 11848.9 03:59:27 INFO - PROCESS | 2042 | 03:59:27 INFO - PROCESS | 2042 | [#3] mootools.html Cycles:180 Average:5896.62 Median:5262.79 stddev:3132.83 (59.5%) stddev-sans-first:3123.44 03:59:27 INFO - PROCESS | 2042 | Values: 1406.8 1573.3 1575.8 1840.0 1932.2 7983.1 8175.4 8186.0 8190.2 8193.5 7802.4 7918.5 7938.1 7938.7 7943.2 2094.2 2132.4 2356.8 2380.6 2387.4 2442.5 2449.6 2450.8 2452.3 2452.5 2354.2 2404.6 2454.5 2456.3 2457.5 2370.3 2397.6 2405.6 2408.6 2410.3 2355.6 2383.7 2386.1 2386.9 2410.3 8537.1 8559.3 8568.2 8590.5 8598.5 5141.0 5262.1 5263.5 5263.6 5265.2 3280.8 3307.2 3319.8 3380.6 3381.8 1096.2 1105.3 1109.8 1174.3 1178.1 11764.9 11787.6 11787.9 11800.8 11836.7 4493.3 4517.5 4589.0 4599.0 4619.2 10119.8 10134.7 10138.0 10145.8 10157.4 5066.3 5075.3 5081.4 5104.0 5120.6 4075.6 4597.7 4685.1 4696.5 4698.6 3868.4 3948.2 3974.9 3980.7 4020.6 1285.6 1296.0 1299.8 1305.6 1316.1 1178.2 1195.4 1402.9 1467.8 1497.1 8161.7 8192.2 8194.4 8212.3 8216.4 552.9 560.4 566.8 567.9 573.2 6025.2 6139.5 6156.7 6164.2 6205.1 10126.1 10553.0 10605.0 10653.5 10655.8 9959.6 10262.0 10362.5 10365.6 10453.0 8077.3 8160.3 8164.6 8225.6 8285.9 7520.1 7595.7 7624.5 7803.5 7809.1 9177.8 9177.9 9315.3 9380.2 9418.2 9411.2 9607.1 9607.3 9780.3 9782.3 6734.8 7076.6 7209.5 7623.3 7673.5 7931.5 7949.7 7984.6 7985.4 8001.0 7122.8 7185.4 7256.5 7278.2 7428.1 6966.1 7138.1 7178.7 7269.0 7280.9 7342.2 7486.3 7499.9 7509.1 7512.6 6866.9 6919.2 6921.1 6939.4 6939.4 6917.9 7095.5 7129.5 7132.9 7146.4 03:59:27 INFO - PROCESS | 2042 | 03:59:27 INFO - PROCESS | 2042 | [#4] prototype.html Cycles:180 Average:5336.91 Median:6016.61 stddev:1580.18 (26.3%) stddev-sans-first:1539.85 03:59:27 INFO - PROCESS | 2042 | Values: 360.9 364.5 367.8 370.1 374.0 6000.8 6007.9 6008.0 6017.7 6027.8 5965.6 5967.8 5969.2 5972.0 5974.6 4487.9 4581.2 4675.8 4699.6 4729.2 4686.8 4687.6 4708.9 4714.9 4715.0 4646.6 4649.2 4650.3 4652.7 4665.3 4445.0 4539.8 4621.9 4650.4 4671.9 4107.8 4110.2 4115.7 4133.9 4139.2 5673.1 5673.6 5679.2 5681.6 5684.9 5430.6 5439.9 5444.5 5447.8 5450.0 6289.2 6298.0 6301.9 6302.1 6308.4 4341.1 4474.3 4493.9 4502.8 4593.7 6524.3 6596.6 6597.3 6602.6 6608.8 4572.9 4584.7 4601.3 4611.3 4611.7 4665.2 4673.4 4679.6 4680.3 4682.8 5335.0 5343.4 5350.9 5355.5 5355.8 6239.9 6352.7 6353.6 6366.1 6388.3 1618.8 1631.1 1639.8 1642.3 1647.2 1035.5 1062.5 1080.9 1101.9 1108.4 6010.5 6015.5 6018.5 6019.7 6036.8 6392.8 6475.2 6509.8 6510.1 6513.5 6102.4 6102.8 6103.8 6108.6 6111.8 3462.0 3495.8 3500.0 3501.4 3506.1 6610.3 6689.8 6741.2 6797.3 6807.1 6739.9 6773.9 6781.8 6784.7 6787.7 6822.3 6831.1 6840.8 6844.5 6851.1 6586.1 6604.3 6609.6 6619.0 6624.0 6227.3 6521.0 6521.0 6537.0 6545.9 6790.6 6828.7 6831.7 6832.0 6841.7 4714.3 4761.0 4766.3 4770.4 4771.4 6534.8 6537.1 6542.1 6550.4 6552.4 6227.0 6267.4 6326.9 6335.7 6353.9 6321.8 6343.2 6350.1 6351.3 6360.1 6123.3 6128.4 6130.0 6131.6 6176.8 6347.8 6361.0 6365.6 6370.2 6384.0 5992.6 6085.3 6112.1 6208.4 6219.8 03:59:27 INFO - PROCESS | 2042 | 03:59:27 INFO - PROCESS | 2042 | [#5] yui.html Cycles:180 Average:13794.00 Median:45746.16 stddev:15643.06 (34.2%) stddev-sans-first:15656.49 03:59:27 INFO - PROCESS | 2042 | Values: 795.4 798.0 799.3 802.6 818.8 13001.3 15276.8 15589.8 15595.0 15603.1 14626.1 14629.6 14638.9 14670.9 14679.9 778.8 908.5 916.1 932.6 938.9 928.5 931.8 932.7 933.3 934.3 806.8 968.4 968.4 975.0 975.9 925.5 946.2 947.2 947.6 948.4 694.7 695.0 695.6 695.7 696.6 13658.2 13763.0 13788.6 13790.9 13797.0 11693.8 12117.9 12154.1 12302.6 12312.3 9728.3 9858.8 9897.1 9986.5 10034.9 3366.7 3387.1 3407.5 3414.2 3520.2 50781.5 50882.7 50926.0 51054.0 51232.0 8743.0 9137.8 9148.0 9275.9 9288.4 18284.7 18290.9 18473.2 18480.2 18549.4 7061.5 7253.8 7283.4 7356.2 7460.4 4112.2 4132.3 4168.5 4196.3 4273.9 3123.6 3296.7 3328.7 3338.8 3342.0 586.0 643.5 653.7 665.4 682.1 619.6 633.1 681.4 684.3 708.1 8479.7 8572.1 8636.7 8645.4 8664.4 609.6 665.2 697.6 711.0 747.4 4001.2 4021.1 4041.2 4153.6 4172.4 57186.4 57302.7 57533.4 57682.7 57973.7 49519.0 50137.5 50297.2 51066.7 51168.0 40269.4 40458.0 40753.4 40910.2 41202.0 8537.8 8566.3 8616.3 8702.6 8713.9 32342.4 33117.8 33381.8 33657.0 34125.3 40670.6 40719.6 44316.0 45368.5 46123.8 11765.2 11978.8 12057.9 12089.2 12159.3 12736.6 12996.4 13064.0 13435.5 13727.8 11765.8 11817.6 11987.5 12008.6 12211.3 11778.6 11970.5 12185.2 12188.4 12297.0 10868.9 11113.6 11166.7 11329.5 11377.2 9704.5 9903.9 9948.1 10131.6 10159.9 9834.7 10147.4 10163.3 10197.2 10253.4 03:59:27 INFO - PROCESS | 2042 | -------- Summary: end -------- 03:59:27 INFO - PROCESS | 2042 | 03:59:27 INFO - TEST-INFO | 2042: exit 0 03:59:27 INFO - TEST-OK | dromaeo_css | took 1111612ms 03:59:27 INFO - TEST-START | kraken 03:59:27 INFO - operating with platform_type : linux_ 03:59:27 INFO - Initialising browser for kraken test... 03:59:27 INFO - TEST-INFO | started process 2229 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpS8w9hw/profile http://localhost:58837/getInfo.html) 03:59:31 INFO - PROCESS | 2229 | __metrics Screen width/height:1600/1200 03:59:31 INFO - PROCESS | 2229 | colorDepth:24 03:59:31 INFO - PROCESS | 2229 | Browser inner width/height: 1024/697 03:59:31 INFO - PROCESS | 2229 | __metrics 03:59:32 INFO - PROCESS | 2229 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:59:33 INFO - TEST-INFO | 2229: exit 0 03:59:33 INFO - Browser initialized. 03:59:33 INFO - Running cycle 1/1 for kraken test... 03:59:33 INFO - TEST-INFO | started process 2322 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpS8w9hw/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:59:45 INFO - PROCESS | 2322 | RSS: Main: 142561280 03:59:45 INFO - PROCESS | 2322 | 03:59:47 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:58837/tests/kraken/driver.html?testName=audio-beat-detection) 03:59:48 INFO - PROCESS | 2322 | RSS: Main: 178094080 03:59:48 INFO - PROCESS | 2322 | 03:59:51 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:58837/tests/kraken/driver.html?testName=audio-dft) 03:59:51 INFO - PROCESS | 2322 | RSS: Main: 176160768 03:59:51 INFO - PROCESS | 2322 | 03:59:54 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:58837/tests/kraken/driver.html?testName=audio-fft) 03:59:54 INFO - PROCESS | 2322 | RSS: Main: 172916736 03:59:54 INFO - PROCESS | 2322 | 03:59:57 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:58837/tests/kraken/driver.html?testName=audio-oscillator) 03:59:57 INFO - PROCESS | 2322 | RSS: Main: 173826048 03:59:57 INFO - PROCESS | 2322 | 03:59:59 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:58837/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:00:00 INFO - PROCESS | 2322 | RSS: Main: 171831296 04:00:00 INFO - PROCESS | 2322 | 04:00:03 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:58837/tests/kraken/driver.html?testName=imaging-darkroom) 04:00:03 INFO - PROCESS | 2322 | RSS: Main: 172126208 04:00:03 INFO - PROCESS | 2322 | 04:00:07 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:58837/tests/kraken/driver.html?testName=imaging-desaturate) 04:00:07 INFO - PROCESS | 2322 | RSS: Main: 172511232 04:00:07 INFO - PROCESS | 2322 | 04:00:10 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:58837/tests/kraken/driver.html?testName=json-parse-financial) 04:00:11 INFO - PROCESS | 2322 | RSS: Main: 171835392 04:00:11 INFO - PROCESS | 2322 | 04:00:12 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:58837/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:00:13 INFO - PROCESS | 2322 | RSS: Main: 177520640 04:00:13 INFO - PROCESS | 2322 | 04:00:15 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:58837/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:00:15 INFO - PROCESS | 2322 | RSS: Main: 175263744 04:00:15 INFO - PROCESS | 2322 | 04:00:17 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:58837/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:00:18 INFO - PROCESS | 2322 | RSS: Main: 181243904 04:00:18 INFO - PROCESS | 2322 | 04:00:20 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:58837/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:00:21 INFO - PROCESS | 2322 | RSS: Main: 186974208 04:00:21 INFO - PROCESS | 2322 | 04:00:23 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:58837/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:00:24 INFO - PROCESS | 2322 | RSS: Main: 187699200 04:00:24 INFO - PROCESS | 2322 | 04:00:25 INFO - PROCESS | 2322 | Cycle 1(1): loaded http://localhost:58837/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:58837/tests/kraken/driver.html?testName=ai-astar) 04:00:26 INFO - PROCESS | 2322 | RSS: Main: 249786368 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | __start_tp_report 04:00:26 INFO - PROCESS | 2322 | _x_x_mozilla_page_load 04:00:26 INFO - PROCESS | 2322 | _x_x_mozilla_page_load_details 04:00:26 INFO - PROCESS | 2322 | |i|pagename|runs| 04:00:26 INFO - PROCESS | 2322 | |0;ai-astar;111;111;106;111;110;112;100;112;111;110 04:00:26 INFO - PROCESS | 2322 | |1;audio-beat-detection;154;127;161;172;137;155;163;128;179;128 04:00:26 INFO - PROCESS | 2322 | |2;audio-dft;163;160;159;160;160;160;161;164;161;161 04:00:26 INFO - PROCESS | 2322 | |3;audio-fft;76;78;75;161;76;76;77;76;170;77 04:00:26 INFO - PROCESS | 2322 | |4;audio-oscillator;91;93;149;92;92;92;148;93;93;139 04:00:26 INFO - PROCESS | 2322 | |5;imaging-gaussian-blur;117;116;117;117;118;117;117;117;116;117 04:00:26 INFO - PROCESS | 2322 | |6;imaging-darkroom;145;146;145;145;145;146;146;146;146;146 04:00:26 INFO - PROCESS | 2322 | |7;imaging-desaturate;95;95;96;96;96;96;95;96;96;96 04:00:26 INFO - PROCESS | 2322 | |8;json-parse-financial;56;57;56;57;56;59;59;66;57;55 04:00:26 INFO - PROCESS | 2322 | |9;json-stringify-tinderbox;63;64;64;63;64;64;64;64;64;66 04:00:26 INFO - PROCESS | 2322 | |10;stanford-crypto-aes;78;79;87;86;78;79;78;85;76;77 04:00:26 INFO - PROCESS | 2322 | |11;stanford-crypto-ccm;111;110;131;113;114;115;113;112;111;120 04:00:26 INFO - PROCESS | 2322 | |12;stanford-crypto-pbkdf2;143;134;143;146;135;136;136;149;145;139 04:00:26 INFO - PROCESS | 2322 | |13;stanford-crypto-sha256-iterative;66;65;68;66;66;65;66;67;66;64 04:00:26 INFO - PROCESS | 2322 | __end_tp_report 04:00:26 INFO - PROCESS | 2322 | __start_cc_report 04:00:26 INFO - PROCESS | 2322 | _x_x_mozilla_cycle_collect,1050 04:00:26 INFO - PROCESS | 2322 | __end_cc_report 04:00:26 INFO - PROCESS | 2322 | __startTimestamp1461754826182__endTimestamp 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | ------- Summary: start ------- 04:00:26 INFO - PROCESS | 2322 | Number of tests: 14 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#0] ai-astar Cycles:10 Average:109.40 Median:111.00 stddev:3.72 (3.3%) stddev-sans-first:3.90 04:00:26 INFO - PROCESS | 2322 | Values: 111.0 111.0 106.0 111.0 110.0 112.0 100.0 112.0 111.0 110.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#1] audio-beat-detection Cycles:10 Average:150.40 Median:158.00 stddev:19.21 (12.2%) stddev-sans-first:20.33 04:00:26 INFO - PROCESS | 2322 | Values: 154.0 127.0 161.0 172.0 137.0 155.0 163.0 128.0 179.0 128.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#2] audio-dft Cycles:10 Average:160.90 Median:161.00 stddev:1.52 (0.9%) stddev-sans-first:1.41 04:00:26 INFO - PROCESS | 2322 | Values: 163.0 160.0 159.0 160.0 160.0 160.0 161.0 164.0 161.0 161.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#3] audio-fft Cycles:10 Average:94.20 Median:76.00 stddev:37.65 (49.5%) stddev-sans-first:39.35 04:00:26 INFO - PROCESS | 2322 | Values: 76.0 78.0 75.0 161.0 76.0 76.0 77.0 76.0 170.0 77.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#4] audio-oscillator Cycles:10 Average:108.20 Median:92.00 stddev:25.76 (28.0%) stddev-sans-first:26.56 04:00:26 INFO - PROCESS | 2322 | Values: 91.0 93.0 149.0 92.0 92.0 92.0 148.0 93.0 93.0 139.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#5] imaging-gaussian-blur Cycles:10 Average:116.90 Median:117.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 04:00:26 INFO - PROCESS | 2322 | Values: 117.0 116.0 117.0 117.0 118.0 117.0 117.0 117.0 116.0 117.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#6] imaging-darkroom Cycles:10 Average:145.60 Median:146.00 stddev:0.52 (0.4%) stddev-sans-first:0.50 04:00:26 INFO - PROCESS | 2322 | Values: 145.0 146.0 145.0 145.0 145.0 146.0 146.0 146.0 146.0 146.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#7] imaging-desaturate Cycles:10 Average:95.70 Median:96.00 stddev:0.48 (0.5%) stddev-sans-first:0.44 04:00:26 INFO - PROCESS | 2322 | Values: 95.0 95.0 96.0 96.0 96.0 96.0 95.0 96.0 96.0 96.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#8] json-parse-financial Cycles:10 Average:57.80 Median:57.00 stddev:3.16 (5.5%) stddev-sans-first:3.28 04:00:26 INFO - PROCESS | 2322 | Values: 56.0 57.0 56.0 57.0 56.0 59.0 59.0 66.0 57.0 55.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#9] json-stringify-tinderbox Cycles:10 Average:64.00 Median:64.00 stddev:0.82 (1.3%) stddev-sans-first:0.78 04:00:26 INFO - PROCESS | 2322 | Values: 63.0 64.0 64.0 63.0 64.0 64.0 64.0 64.0 64.0 66.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#10] stanford-crypto-aes Cycles:10 Average:80.30 Median:79.00 stddev:4.06 (5.1%) stddev-sans-first:4.22 04:00:26 INFO - PROCESS | 2322 | Values: 78.0 79.0 87.0 86.0 78.0 79.0 78.0 85.0 76.0 77.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#11] stanford-crypto-ccm Cycles:10 Average:115.00 Median:113.50 stddev:6.29 (5.5%) stddev-sans-first:6.50 04:00:26 INFO - PROCESS | 2322 | Values: 111.0 110.0 131.0 113.0 114.0 115.0 113.0 112.0 111.0 120.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:140.60 Median:143.00 stddev:5.27 (3.7%) stddev-sans-first:5.52 04:00:26 INFO - PROCESS | 2322 | Values: 143.0 134.0 143.0 146.0 135.0 136.0 136.0 149.0 145.0 139.0 04:00:26 INFO - PROCESS | 2322 | 04:00:26 INFO - PROCESS | 2322 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.90 Median:66.00 stddev:1.10 (1.7%) stddev-sans-first:1.17 04:00:26 INFO - PROCESS | 2322 | Values: 66.0 65.0 68.0 66.0 66.0 65.0 66.0 67.0 66.0 64.0 04:00:26 INFO - PROCESS | 2322 | -------- Summary: end -------- 04:00:26 INFO - PROCESS | 2322 | 04:00:27 INFO - TEST-INFO | 2322: exit 0 04:00:27 INFO - TEST-OK | kraken | took 59190ms 04:00:27 INFO - SUITE-END | took 1170s 04:00:27 INFO - Completed test suite (00:19:30) 04:00:27 INFO - javascript benchmark 04:00:27 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3297.3240485700435, 3349.8492567834446, 3363.495475678649, 3370.5618269624947, 3395.1342407686043, 5485.149801780725, 5485.369182544008, 5489.752961116749, 5492.121260598305, 5503.20203570482, 5452.482014208654, 5462.20797984292, 5469.781208751655, 5484.314460692413, 5488.094464413377, 4781.976090119544, 4977.975110124445, 5024.371953505812, 5047.293378926953, 5096.337476128117, 4962.851114466572, 4972.25416187573, 5002.12462819007, 5044.445111037783, 5102.081625307444, 5062.0, 5086.821961231358, 5092.159793634046, 5092.643514953955, 5109.6678715883345, 4834.564889159958, 5014.398272207322, 5019.498050194988, 5070.822521211759, 5083.898322033557, 4940.604751619861, 4995.325631039799, 5004.224345226496, 5007.974960125176, 5047.2429135629945, 5352.678839269656, 5360.678359298455, 5373.032854086263, 5401.4868587484125, 5418.566514678816, 5774.855628609276, 5853.0, 5928.170056192136, 5931.703414829241, 5938.346781853993, 5889.617174883661, 5899.262592175978, 5909.4090590941, 5932.762689492415, 5948.643081415085, 5515.834524964257, 5520.089185284463, 5521.116621340607, 5523.143912693498, 5526.696031718294, 5928.466438020599, 6005.669688167105, 6034.155218269446, 6044.9395506044375, 6115.4190351916495, 5751.424857514216, 5753.482186603226, 5755.280589926259, 5756.5682573807135, 5790.88418231633, 5817.0, 5850.268716410449, 5851.531877449794, 5851.824445266649, 5858.970705146447, 5786.132080188006, 5826.388229235954, 5882.499987501024, 6003.339632640406, 6016.1878146450545, 5823.82528524145, 5841.795537156264, 5864.354920958691, 5867.178594996704, 5876.588638795243, 4464.4865840428765, 4480.260756975128, 4484.237679594412, 4490.012197316585, 4511.233090374644, 3919.431682406035, 4011.5587285398583, 4064.1871625674985, 4072.511298644182, 4110.547839737626, 5542.418046105182, 5584.078627026576, 5594.608377413542, 5600.215969764236, 5609.803656872072, 5801.796937107181, 5928.703564821742, 5945.762169513171, 5947.672877991666, 5948.286205655262, 5521.337439507204, 5549.334079910436, 5570.832875013756, 5613.0, 5632.211490391349, 5059.2916991621205, 5065.366829146356, 5069.670471419346, 5071.746412679351, 5107.795688172431, 6011.308699499614, 6036.456718895321, 6059.515238780887, 6064.969675151596, 6071.423214794588, 5968.313643931004, 5987.072003839412, 6001.90997135052, 6002.639841609517, 6009.669468179292, 6091.725872335667, 6101.725422356093, 6103.786367477117, 6111.84720381994, 6143.662098584621, 5627.915581266366, 5740.0, 5790.0, 5896.557758168069, 5914.408559144051, 5934.19888315072, 5970.3432622412365, 5971.970140149445, 5981.52147828164, 5983.431574000463, 5787.797427090031, 5808.912866307093, 5812.738426770721, 5813.534917206529, 5817.70911454434, 5621.634593751393, 5662.292213473316, 5734.684592347461, 5765.682887441231, 5776.075827867521, 5662.0, 5665.291838520185, 5689.829305120853, 5694.974904517227, 5698.0, 5822.679752613478, 5830.47525722687, 5843.649381036981, 5866.853328666647, 5868.501177399969, 5592.748326325243, 5627.718614069198, 5628.493435590816, 5691.231683722644, 5727.770889164387], "unit": "score", "name": "dojo.html", "value": 5439.966953866311}, {"lowerIsBetter": false, "replicates": [552.8061741009836, 561.2086957390078, 572.6850232372195, 580.1703563903616, 590.8050343386683, 38227.23545529088, 38635.420468692995, 38649.0, 38682.61317386829, 38798.806005969964, 41788.0, 42503.36244956328, 42557.7872110639, 42578.36132458008, 42583.574164258345, 8685.218330350268, 8877.378583499125, 8879.245264152523, 8880.24517915978, 8880.422772519765, 8702.695405660803, 8837.072107428723, 8842.248408885253, 8959.193672569467, 8992.23565996891, 8946.060663630322, 9028.909710902906, 9029.458232506038, 9032.909670903306, 9045.276377889786, 8996.8650470243, 9064.410813297114, 9069.727908162766, 9080.318976076755, 9088.863667045, 9130.771730706785, 9255.768605784842, 9277.814443711088, 9281.21109705676, 9282.396644218104, 41632.75101746953, 42078.36882446766, 42106.789466052476, 42165.57834421647, 42211.36682949758, 3774.9245015099546, 3830.80845957701, 4043.2317859606583, 4074.7555146691293, 4488.236999710057, 32845.34309313824, 33064.3387132256, 33112.17219569506, 33246.168845778804, 34543.827280863436, 3628.2743451309843, 3697.8335974881193, 3705.1478160023075, 3742.438634204891, 3763.040424691686, 288384.0, 289941.0, 291376.0, 292418.99999999785, 293472.0, 45604.54395456069, 46155.615216554375, 46293.0, 62660.686696567136, 62915.0, 43801.342979855326, 43888.0, 43942.780286098365, 43951.560484395384, 44066.779666101465, 15907.840921590867, 16055.598610034609, 16066.437674681563, 16081.195940202942, 16082.276297566403, 12718.364081795873, 12724.809127863089, 12757.936210318889, 12759.043071769654, 12776.680582985315, 15513.146776927377, 15543.922280388526, 15646.0, 15667.216639168224, 15689.921550392175, 5824.271966004249, 5847.1229315603, 5862.179294898718, 6020.8795824084145, 6034.547408944259, 1134.9943250283861, 1143.8398624192619, 1154.722866512031, 1174.1252766688872, 1222.4498975461079, 29068.27329316784, 29442.558361624593, 29693.703062969525, 29941.700582994326, 30428.84785576058, 1103.6578660615235, 1140.2417392434104, 1163.3834067944003, 1203.9337836419081, 1226.3255209634845, 15725.0, 15732.528024159294, 15978.76031859523, 16045.518634440985, 16134.034452937694, 326106.0, 329171.0, 329224.0, 329341.0, 331247.0, 56833.43166568364, 57593.272201834014, 57730.42269577335, 57741.0, 57928.420715793145, 1348.3932230496316, 1456.8543145685346, 1465.4577806211769, 1499.9400023999135, 1507.796447479598, 29036.7096329034, 29467.85266073656, 29555.261118472212, 30064.849675752357, 30290.24274393158, 45802.77098614485, 46808.76595617, 46832.42421666841, 46874.296885546064, 46912.0, 224437.0, 228078.0, 229154.0, 229823.0, 229893.0, 30302.090937271918, 34784.47823282602, 34881.0, 34918.65081349255, 35451.46822797608, 42293.0, 44119.77940110279, 50913.0, 51504.48495514997, 52094.0, 40454.39318410285, 41165.382519261635, 41445.378319325835, 41961.160776784905, 42473.57526424696, 40008.3998740025, 41649.79175104105, 41788.0, 41864.372034420114, 41932.16135677331, 39622.60377396304, 40582.0, 40687.79656101701, 41488.37767433551, 41713.37429938614, 36663.0, 36705.26589468249, 36823.63176368309, 37745.0, 38018.429723553614, 25970.74029259683, 26043.218703438928, 26702.866485667448, 26769.86615066912, 26980.73019269782], "unit": "score", "name": "ext.html", "value": 18929.851570637213}, {"lowerIsBetter": false, "replicates": [377.9584245732969, 386.8239950822373, 390.98045097745114, 394.94470774091633, 395.274670978754, 16996.915015424922, 18689.4393168205, 18936.810631893677, 19086.04569771513, 19129.139188736506, 11907.702307442318, 17874.910625446886, 18617.16222769975, 18628.72056919147, 18629.161687724052, 5077.923831142536, 5201.635885488017, 5230.372355317368, 5239.240310155025, 5247.317848679666, 4112.0, 5718.399568045358, 5928.644281343111, 5948.7620495180145, 5951.9107213391835, 5642.858928526799, 5911.408859114097, 5914.792982245623, 5931.051031834907, 5947.286325640929, 5737.168110623957, 5740.0, 5774.797882074149, 5788.479036886701, 5824.417558244184, 3961.98019009906, 5421.268128802601, 5642.069058605325, 5652.9152062719095, 5654.491095801356, 13582.728345433135, 13588.93205533966, 13591.660208494768, 20001.599968000704, 22206.333809985725, 2298.069281940817, 2300.1719381022817, 2374.643803429482, 2390.2829151254728, 2936.985315073411, 13375.665608359868, 14679.266036698122, 14853.405863765436, 15534.0, 15536.922315388463, 1999.9100040498067, 2046.7339245898088, 2049.3749406431034, 2058.3927741316197, 2071.0887209627717, 70472.647636762, 73378.0, 73649.6317518409, 73970.0, 75706.62146689286, 15175.620609484631, 15567.377304907677, 15762.369505219664, 15922.920385397998, 16117.355305787873, 26664.20007399781, 26880.462390752076, 27070.05254816072, 27093.593596096074, 27263.182104536896, 9266.166045055978, 9475.241980641533, 9529.714108576754, 9644.18024467914, 9679.612815487442, 8111.026676798822, 8157.877631835528, 8174.3460523158, 8273.669053237923, 8387.161283871565, 8146.389020823462, 8160.97987751531, 8186.877196842052, 8212.0, 8368.995720513578, 2480.9751902481107, 2954.4091181763733, 3128.8592013359, 3171.7938334008218, 3351.9664803352143, 994.2493417469908, 1020.1685626214611, 1036.036486067949, 1041.4844651897208, 1060.5798034312907, 16943.661126777642, 17225.65548689019, 17263.827361726475, 17510.0, 17966.820331796775, 982.626601891291, 992.8858181309242, 999.8050380175941, 1016.3241444439512, 1019.6788011776267, 9836.06557377048, 10082.59669613222, 10115.381538953732, 10123.696289111338, 10178.033086856736, 456082.0, 461508.0, 466917.0, 473488.0, 474995.0, 70589.64705176442, 71713.28286717067, 72217.6389118051, 72878.2712172882, 72901.0, 1026.4098143567478, 1035.2649618770756, 1038.7299302181486, 1048.5910494906993, 1078.191356482638, 15588.270449022, 15681.215939202766, 15724.528264152093, 15725.370985160465, 15868.0, 33308.500372493945, 33471.16322091967, 33759.4680398976, 33998.8300058508, 34431.65568344285, 47296.0, 47347.0, 47397.052058959314, 47521.762391187825, 48314.0, 8422.494650321001, 8493.362997775068, 8495.575221239036, 8496.192861678132, 8564.057953624972, 9620.860630438634, 13086.607401777961, 13222.47110115623, 13430.529931452744, 13552.93223533876, 11098.167637427387, 11393.487293071666, 11551.537938482366, 11574.421278935852, 11733.88266117362, 11246.606368777053, 11356.205065645325, 11368.886311136783, 11528.789477104783, 11581.420928953687, 11378.0, 11564.94217528907, 11588.594399195988, 11768.117391195865, 11970.521179152736, 8230.753077407688, 8328.708495202638, 8363.540005299767, 8507.489550626982, 8573.442726223026, 11222.775544489228, 11432.542698291974, 11575.652730418102, 11703.531858725555, 11848.940755296167], "unit": "score", "name": "jquery.html", "value": 9430.657063576848}, {"lowerIsBetter": false, "replicates": [1406.7678832992556, 1573.3234709075098, 1575.7951466309378, 1839.9724004139932, 1932.2077948041306, 7983.08194557626, 8175.427720059583, 8186.0, 8190.221928916743, 8193.549354785484, 7802.375809935205, 7918.485298455596, 7938.087119981204, 7938.682452701885, 7943.165967573408, 2094.2042024030848, 2132.4455641533236, 2356.8114550835935, 2380.6191009438494, 2387.415083304593, 2442.4504486490487, 2449.5835707929696, 2450.76717711818, 2452.2520631207476, 2452.460458699092, 2354.152505098163, 2404.615261558151, 2454.472288457981, 2456.250843492734, 2457.533068716947, 2370.3126093432884, 2397.6283676030157, 2405.5549723301247, 2408.638704194367, 2410.313060777679, 2355.599548076831, 2383.7377888432256, 2386.140989243871, 2386.868722220277, 2410.288964755401, 8537.103604121601, 8559.27246184075, 8568.186022327869, 8590.484570925702, 8598.4840909545, 5141.0, 5262.05283049051, 5263.526282634582, 5263.552598029172, 5265.183896496049, 3280.7703460757757, 3307.1732066983254, 3319.7842140260805, 3380.594328680574, 3381.830908454592, 1096.1888202730001, 1105.2981356838386, 1109.8002359575273, 1174.3364998775664, 1178.0810967445407, 11764.882351176464, 11787.587434439753, 11787.88212117885, 11800.822987655107, 11836.704082397922, 4493.326001099861, 4517.548245175456, 4589.036302376471, 4599.034202817379, 4619.214733495314, 10119.797604048024, 10134.746631334276, 10138.03688649577, 10145.847812282822, 10157.441340726331, 5066.341375621146, 5075.289459475676, 5081.441041485434, 5104.0, 5120.564751996122, 4075.572064933199, 4597.678162528658, 4685.1098291325225, 4696.483386827446, 4698.553637404441, 3868.361720316116, 3948.230095131479, 3974.8608798691907, 3980.681545476355, 4020.557738648746, 1285.5500574798746, 1296.0409297120063, 1299.753046921082, 1305.595265467708, 1316.1116246533743, 1178.2105988987398, 1195.4321697193936, 1402.8877689784792, 1467.801846750675, 1497.1316636350891, 8161.714339998071, 8192.18078192188, 8194.385421093442, 8212.260896519341, 8216.383771217183, 552.8562573730778, 560.3639868749, 566.8469513231404, 567.9261695979496, 573.2175580332815, 6025.186599809057, 6139.508839292936, 6156.661383623854, 6164.198654174928, 6205.069239614094, 10126.088652021206, 10552.99746524079, 10605.045545900906, 10653.520591573399, 10655.786884262272, 9959.551820167964, 10262.025107614765, 10362.481875906175, 10365.585376584851, 10453.0, 8077.27304542594, 8160.3471722262075, 8164.591770411455, 8225.629846657035, 8285.917140828515, 7520.059992500937, 7595.658195381111, 7624.504407213513, 7803.531788092732, 7809.062912450542, 9177.816443671223, 9177.862332064891, 9315.301352398732, 9380.202682771767, 9418.199453046567, 9411.247100231829, 9607.087326703951, 9607.279454040836, 9780.315377923476, 9782.266330025133, 6734.764283250062, 7076.646167691698, 7209.4592905533345, 7623.275788800055, 7673.53958762476, 7931.524108553505, 7949.682012719427, 7984.600769961595, 7985.361171106414, 8000.959995199987, 7122.8219294515975, 7185.353318201387, 7256.528325658815, 7278.163011253562, 7428.1086269647985, 6966.12923384577, 7138.072050633385, 7178.748743793943, 7269.0, 7280.9271907280245, 7342.192358840416, 7486.326230639269, 7499.925000749922, 7509.136449308181, 7512.586807725409, 6866.896996545156, 6919.169699636076, 6921.065656136358, 6939.375456208965, 6939.444844412334, 6917.896231556631, 7095.503314767917, 7129.536580122275, 7132.928670713226, 7146.428285737233], "unit": "score", "name": "mootools.html", "value": 4753.00820813486}, {"lowerIsBetter": false, "replicates": [360.90255630979635, 364.49881413057045, 367.78300802526513, 370.13388670511, 374.04804771855623, 6000.75996960121, 6007.879842403149, 6007.969960150199, 6017.699115044246, 6027.849303767408, 5965.552583556239, 5967.791127310545, 5969.194158788562, 5971.970140149304, 5974.581779275452, 4487.887802804939, 4581.152486789938, 4675.8363457279, 4699.553542413474, 4729.2433210686295, 4686.765661716918, 4687.554682305193, 4708.929366059512, 4714.929276060861, 4714.976425117869, 4646.605038571709, 4649.163150632885, 4650.325702773096, 4652.697574657636, 4665.300204969265, 4445.0, 4539.818407263722, 4621.907561848744, 4650.372199753024, 4671.906561868777, 4107.794610269475, 4110.23960567296, 4115.650169735576, 4133.91732165358, 4139.21354942563, 5673.120666296731, 5673.574481913873, 5679.176519404705, 5681.602287839853, 5684.886302273972, 5430.59270554706, 5439.945600543983, 5444.537214336786, 5447.836564903059, 5449.99175152594, 6289.213848268966, 6298.0, 6301.87396252077, 6302.149209856657, 6308.400701933309, 4341.110072435144, 4474.306482495218, 4493.9101217975785, 4502.8198872045405, 4593.678442509025, 6524.314946930599, 6596.571222870498, 6597.274299827015, 6602.60384376939, 6608.834779130512, 4572.942176020738, 4584.701994370355, 4601.263797792337, 4611.262198048296, 4611.654125940568, 4665.2302370108555, 4673.369095172108, 4679.555442232982, 4680.297955306732, 4682.765861706901, 5335.039692855324, 5343.3587969443915, 5350.946490535122, 5355.527230011778, 5355.839324820262, 6239.937600623935, 6352.745890164434, 6353.5870168438905, 6366.140571022946, 6388.329225431356, 1618.765279034557, 1631.078440681035, 1639.7868277123898, 1642.3348543839763, 1647.1928754910007, 1035.5081336365317, 1062.511244827388, 1080.9135269178446, 1101.9063379612662, 1108.4014632098738, 6010.549208809357, 6015.518758499309, 6018.548608854353, 6019.729112189962, 6036.788712395045, 6392.840178995562, 6475.158229430144, 6509.804705858832, 6510.121133646897, 6513.511486638521, 6102.359252278447, 6102.755889764359, 6103.755849766048, 6108.602940808833, 6111.786087486917, 3461.9653803462147, 3495.8426870790877, 3499.950014995491, 3501.3697534444045, 3506.1234691327168, 6610.338966103352, 6689.799306020827, 6741.22475915276, 6797.320267973262, 6807.115075040213, 6739.898901516482, 6773.8645227095185, 6781.796546103625, 6784.694688739019, 6787.728490860311, 6822.317768223138, 6831.146106736658, 6840.760573379908, 6844.452443804484, 6851.143607049119, 6586.077949087227, 6604.348912771807, 6609.636469994197, 6619.040239165391, 6624.0, 6227.287495938653, 6520.989246666774, 6521.0, 6537.0, 6545.8690826184165, 6790.626515541692, 6828.726850926106, 6831.726730930906, 6831.9658401707675, 6841.692123854339, 4714.3399924011355, 4761.047790441856, 4766.285057241442, 4770.403699537558, 4771.403574553181, 6534.8366290843105, 6537.117489139096, 6542.084108224947, 6550.443212327005, 6552.443042341264, 6226.965828345788, 6267.435930766253, 6326.873462530815, 6335.714892829926, 6353.936460635335, 6321.841953951188, 6343.238811342484, 6350.1109844622715, 6351.2696039956, 6360.141380913517, 6123.2958209804665, 6128.387161283836, 6129.969350153221, 6131.570790044654, 6176.81469555914, 6347.809565713036, 6360.968195158995, 6365.586236894587, 6370.203724534434, 6383.968080159755, 5992.550558708027, 6085.3306136325855, 6112.144299797943, 6208.379162083756, 6219.813405597839], "unit": "score", "name": "prototype.html", "value": 4830.958596270468}, {"lowerIsBetter": false, "replicates": [795.4431897671632, 797.968081276749, 799.2766546275623, 802.5545822068751, 818.8321394114205, 13001.284929328884, 15276.770848437282, 15589.844101558981, 15595.0, 15603.063816171038, 14626.122432654049, 14629.634259143526, 14638.926805365958, 14670.853291467081, 14679.853201467982, 778.8481246157002, 908.4776253654159, 916.0976438208393, 932.5570354081825, 938.8920274168455, 928.5450129436562, 931.8229536388098, 932.7061975477736, 933.3140141995627, 934.2666007184328, 806.7620052084649, 968.4383057826444, 968.4479846487505, 974.9756256093583, 975.8828940527146, 925.5002298758662, 946.186279799372, 947.1854205383399, 947.5641205045653, 948.4262021476976, 694.6873906741986, 694.9548279361825, 695.5965539986795, 695.7495301691387, 696.6168607266034, 13658.248796316198, 13763.036587438883, 13788.586342409744, 13790.931045344809, 13797.034207605471, 11693.766124677544, 12117.878821211763, 12154.088443366783, 12302.630921072383, 12312.26126432417, 9728.270379721549, 9858.802823943553, 9897.109260166548, 9986.450745209011, 10034.89965100347, 3366.7138293245102, 3387.120947194889, 3407.454807230831, 3414.2488652496413, 3520.2255503789124, 50781.492185078416, 50882.745586271834, 50926.0, 51053.99999999963, 51232.0, 8743.0, 9137.77155571116, 9147.993720690718, 9275.907240927505, 9288.396254243453, 18284.725729114074, 18290.902545847293, 18473.1687074082, 18480.168392422373, 18549.35077272289, 7061.540999834994, 7253.818654533573, 7283.380912622486, 7356.227596102439, 7460.3658689012045, 4112.239235741397, 4132.297509423405, 4168.478940132483, 4196.328587426058, 4273.893152671208, 3123.593932788723, 3296.7197788188273, 3328.6504916983854, 3338.849751761177, 3342.0308110648125, 585.9560532960045, 643.4594940250118, 653.7254353171679, 665.4077870695086, 682.0791930893255, 619.5972617798377, 633.0567454492865, 681.3799442507294, 684.3498676257575, 708.0936401406208, 8479.660813567512, 8572.099929507436, 8636.697715579925, 8645.394822362374, 8664.393492455467, 609.5611159964818, 665.1818263535781, 697.5675081449432, 711.0, 747.4020783373388, 4001.2197621463533, 4021.1153546219784, 4041.211963667057, 4153.646940010072, 4172.436721042621, 57186.42813571811, 57302.7134864323, 57533.42466575364, 57682.7115864418, 57973.710131449916, 49519.0, 50137.498625014014, 50297.24554131691, 51066.744666276434, 51167.97664046698, 40269.39595906064, 40458.0, 40753.38869916953, 40910.18179636331, 41202.0, 8537.82924341522, 8566.314694824274, 8616.310695144248, 8702.564871756513, 8713.91286087131, 32342.35315293728, 33117.83441082779, 33381.83309083536, 33657.0, 34125.31749365049, 40670.59329406668, 40719.59280407277, 44316.0, 45368.546314536434, 46123.76938115288, 11765.176437649625, 11978.820317695066, 12057.939710301393, 12089.15375923677, 12159.270443773048, 12736.554220602606, 12996.350182491027, 13064.0, 13435.462581496631, 13727.794083088562, 11765.823512647146, 11817.586384476503, 11987.460564274454, 12008.60180717793, 12211.328376938998, 11778.646640600795, 11970.521179152736, 12185.207961482476, 12188.390580471118, 12297.0, 10868.891311086787, 11113.555457781922, 11166.720831979266, 11329.546818127183, 11377.203595748219, 9704.514774261117, 9903.851442228517, 9948.104670579683, 10131.594736210469, 10159.898401015895, 9834.655787047419, 10147.441890696082, 10163.288569800043, 10197.23520735933, 10253.436061016715], "unit": "score", "name": "yui.html", "value": 6489.908912376212}], "name": "dromaeo_css", "value": 7245.925794579137}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 111.0, 106.0, 111.0, 110.0, 112.0, 100.0, 112.0, 111.0, 110.0], "unit": "score", "name": "ai-astar", "value": 109.4}, {"lowerIsBetter": true, "replicates": [154.0, 127.0, 161.0, 172.0, 137.0, 155.0, 163.0, 128.0, 179.0, 128.0], "unit": "score", "name": "audio-beat-detection", "value": 150.4}, {"lowerIsBetter": true, "replicates": [163.0, 160.0, 159.0, 160.0, 160.0, 160.0, 161.0, 164.0, 161.0, 161.0], "unit": "score", "name": "audio-dft", "value": 160.9}, {"lowerIsBetter": true, "replicates": [76.0, 78.0, 75.0, 161.0, 76.0, 76.0, 77.0, 76.0, 170.0, 77.0], "unit": "score", "name": "audio-fft", "value": 94.2}, {"lowerIsBetter": true, "replicates": [91.0, 93.0, 149.0, 92.0, 92.0, 92.0, 148.0, 93.0, 93.0, 139.0], "unit": "score", "name": "audio-oscillator", "value": 108.2}, {"lowerIsBetter": true, "replicates": [117.0, 116.0, 117.0, 117.0, 118.0, 117.0, 117.0, 117.0, 116.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.9}, {"lowerIsBetter": true, "replicates": [145.0, 146.0, 145.0, 145.0, 145.0, 146.0, 146.0, 146.0, 146.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 145.6}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 96.0, 96.0, 96.0, 96.0, 95.0, 96.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.7}, {"lowerIsBetter": true, "replicates": [56.0, 57.0, 56.0, 57.0, 56.0, 59.0, 59.0, 66.0, 57.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 57.8}, {"lowerIsBetter": true, "replicates": [63.0, 64.0, 64.0, 63.0, 64.0, 64.0, 64.0, 64.0, 64.0, 66.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.0}, {"lowerIsBetter": true, "replicates": [78.0, 79.0, 87.0, 86.0, 78.0, 79.0, 78.0, 85.0, 76.0, 77.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.3}, {"lowerIsBetter": true, "replicates": [111.0, 110.0, 131.0, 113.0, 114.0, 115.0, 113.0, 112.0, 111.0, 120.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 115.0}, {"lowerIsBetter": true, "replicates": [143.0, 134.0, 143.0, 146.0, 135.0, 136.0, 136.0, 149.0, 145.0, 139.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 140.6}, {"lowerIsBetter": true, "replicates": [66.0, 65.0, 68.0, 66.0, 66.0, 65.0, 66.0, 67.0, 66.0, 64.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 65.9}], "name": "kraken", "value": 1504.9}]} 04:00:27 INFO - Return code: 0 04:00:27 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 04:00:27 INFO - # TBPL SUCCESS # 04:00:27 INFO - Running post-action listener: _resource_record_post_action 04:00:27 INFO - Running post-run listener: _resource_record_post_run 04:00:28 INFO - Total resource usage - Wall time: 1187s; CPU: 13.0%; Read bytes: 282624; Write bytes: 361504768; Read time: 60; Write time: 255596 04:00:28 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 122671104; Read time: 0; Write time: 91592 04:00:28 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 282624; Write bytes: 237498368; Read time: 60; Write time: 161696 04:00:28 INFO - Running post-run listener: _upload_blobber_files 04:00:28 INFO - Blob upload gear active. 04:00:28 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:00:28 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 04:00:28 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-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:00:28 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-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:00:28 INFO - (blobuploader) - INFO - Open directory for files ... 04:00:28 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 04:00:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:00:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:00:29 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 04:00:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:00:29 INFO - (blobuploader) - INFO - Done attempting. 04:00:29 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 04:00:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:00:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:00:30 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 04:00:30 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:00:30 INFO - (blobuploader) - INFO - Done attempting. 04:00:30 INFO - (blobuploader) - INFO - Iteration through files over. 04:00:30 INFO - Return code: 0 04:00:30 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:00:30 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:00:30 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/901bb62a9ee35742c650e56e13dd57d4ca5bc18bd94f427561d107c05f3e86e67b9fdb185a8d5ae1652a09cd5b78b7f942dc858de547fbeb680b7bb793cacdc7", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/eb34b3efdf3f00489e9b2c526e681937102263e03a9092d12c941237f46ddecffa95e69dadcfdeb23b0afbc9a1f8a4e216d3b6dc032d5d340f37c4d51a5b1c44"} 04:00:30 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:00:30 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:00:30 INFO - Contents: 04:00:30 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/901bb62a9ee35742c650e56e13dd57d4ca5bc18bd94f427561d107c05f3e86e67b9fdb185a8d5ae1652a09cd5b78b7f942dc858de547fbeb680b7bb793cacdc7", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/eb34b3efdf3f00489e9b2c526e681937102263e03a9092d12c941237f46ddecffa95e69dadcfdeb23b0afbc9a1f8a4e216d3b6dc032d5d340f37c4d51a5b1c44"} 04:00:30 INFO - Running post-run listener: copy_logs_to_upload_dir 04:00:30 INFO - Copying logs to upload dir... 04:00:30 INFO - mkdir: /builds/slave/test/build/upload/logs 04:00:30 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1256.359053 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 56 secs) (at 2016-04-27 04:00:30.482778) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-27 04:00:30.486589) ========= 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=4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773 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-Aurora/sha512/901bb62a9ee35742c650e56e13dd57d4ca5bc18bd94f427561d107c05f3e86e67b9fdb185a8d5ae1652a09cd5b78b7f942dc858de547fbeb680b7bb793cacdc7", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/eb34b3efdf3f00489e9b2c526e681937102263e03a9092d12c941237f46ddecffa95e69dadcfdeb23b0afbc9a1f8a4e216d3b6dc032d5d340f37c4d51a5b1c44"} build_url:https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011266 build_url: 'https://queue.taskcluster.net/v1/task/ZpuBLsfqRea_aIl5YentDQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/901bb62a9ee35742c650e56e13dd57d4ca5bc18bd94f427561d107c05f3e86e67b9fdb185a8d5ae1652a09cd5b78b7f942dc858de547fbeb680b7bb793cacdc7", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/eb34b3efdf3f00489e9b2c526e681937102263e03a9092d12c941237f46ddecffa95e69dadcfdeb23b0afbc9a1f8a4e216d3b6dc032d5d340f37c4d51a5b1c44"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-27 04:00:30.511255) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-27 04:00:30.511638) ========= 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=4ac8d263c7293b36a1be1aed000001be-1461753506.814847-1838592773 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004450 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-27 04:00:30.593913) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-27 04:00:30.594230) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-27 04:00:30.594515) ========= ========= Total master_lag: 0.18 =========