builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-033 starttime: 1467378198.11 results: success (0) buildid: 20160701030522 builduid: e5a2507dd92d48b2bfa6b334bb5b81f7 revision: 9512f571459bbc816dda70d2a554cad8e848e67e ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.107521) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.108081) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.108412) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.156345) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.156653) ========= 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=edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-01 06:03:18-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 102M=0s 2016-07-01 06:03:18 (102 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.120766 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.293657) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.294040) ========= 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=edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019819 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.344689) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.345147) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 9512f571459bbc816dda70d2a554cad8e848e67e --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 9512f571459bbc816dda70d2a554cad8e848e67e --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=edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-01 06:03:18,577 truncating revision to first 12 chars 2016-07-01 06:03:18,577 Setting DEBUG logging. 2016-07-01 06:03:18,578 attempt 1/10 2016-07-01 06:03:18,578 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/9512f571459b?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-01 06:03:18,894 unpacking tar archive at: mozilla-beta-9512f571459b/testing/mozharness/ program finished with exit code 0 elapsedTime=0.629507 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.990699) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.991438) ========= script_repo_revision: 9512f571459bbc816dda70d2a554cad8e848e67e ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.992397) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:18.992970) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-01 06:03:19.007671) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 27 secs) (at 2016-07-01 06:03:19.008006) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 06:03:19 INFO - MultiFileLogger online at 20160701 06:03:19 in /builds/slave/test 06:03:19 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 06:03:19 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 06:03:19 INFO - {'append_to_log': False, 06:03:19 INFO - 'base_work_dir': '/builds/slave/test', 06:03:19 INFO - 'blob_upload_branch': 'Mozilla-Beta', 06:03:19 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 06:03:19 INFO - 'branch': 'Mozilla-Beta', 06:03:19 INFO - 'buildbot_json_path': 'buildprops.json', 06:03:19 INFO - 'config_files': ('talos/linux_config.py',), 06:03:19 INFO - 'default_actions': ('clobber', 06:03:19 INFO - 'read-buildbot-config', 06:03:19 INFO - 'download-and-extract', 06:03:19 INFO - 'populate-webroot', 06:03:19 INFO - 'create-virtualenv', 06:03:19 INFO - 'install', 06:03:19 INFO - 'run-tests'), 06:03:19 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:03:19 INFO - 'download_minidump_stackwalk': True, 06:03:19 INFO - 'download_symbols': 'ondemand', 06:03:19 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:03:19 INFO - 'tooltool.py': '/tools/tooltool.py', 06:03:19 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:03:19 INFO - '/tools/misc-python/virtualenv.py')}, 06:03:19 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:03:19 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:03:19 INFO - 'installer_path': 'installer.exe', 06:03:19 INFO - 'log_level': 'info', 06:03:19 INFO - 'log_name': 'talos', 06:03:19 INFO - 'log_to_console': True, 06:03:19 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 06:03:19 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 06:03:19 INFO - 'opt_config_files': (), 06:03:19 INFO - 'pip_index': False, 06:03:19 INFO - 'sps_profile': False, 06:03:19 INFO - 'sps_profile_interval': 0, 06:03:19 INFO - 'suite': 'dromaeojs', 06:03:19 INFO - 'system_bits': '32', 06:03:19 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:03:19 INFO - 'title': 'talos-linux64-ix-033', 06:03:19 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:03:19 INFO - 'use_talos_json': True, 06:03:19 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 06:03:19 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:03:19 INFO - 'work_dir': 'build'} 06:03:19 INFO - ##### 06:03:19 INFO - ##### Running clobber step. 06:03:19 INFO - ##### 06:03:19 INFO - Running pre-action listener: _resource_record_pre_action 06:03:19 INFO - Running main action method: clobber 06:03:19 INFO - rmtree: /builds/slave/test/build 06:03:19 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 06:03:19 INFO - Running post-action listener: _resource_record_post_action 06:03:19 INFO - ##### 06:03:19 INFO - ##### Running read-buildbot-config step. 06:03:19 INFO - ##### 06:03:19 INFO - Running pre-action listener: _resource_record_pre_action 06:03:19 INFO - Running main action method: read_buildbot_config 06:03:19 INFO - Using buildbot properties: 06:03:19 INFO - { 06:03:19 INFO - "project": "", 06:03:19 INFO - "product": "firefox", 06:03:19 INFO - "script_repo_revision": "production", 06:03:19 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs", 06:03:19 INFO - "repository": "", 06:03:19 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs", 06:03:19 INFO - "buildid": "20160701030522", 06:03:19 INFO - "pgo_build": "True", 06:03:19 INFO - "basedir": "/builds/slave/test", 06:03:19 INFO - "buildnumber": 148, 06:03:19 INFO - "slavename": "talos-linux64-ix-033", 06:03:19 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 06:03:19 INFO - "platform": "ubuntu64_hw", 06:03:19 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 06:03:19 INFO - "branch": "mozilla-beta", 06:03:19 INFO - "repo_path": "releases/mozilla-beta", 06:03:19 INFO - "revision": "9512f571459bbc816dda70d2a554cad8e848e67e", 06:03:19 INFO - "stage_platform": "linux64-pgo", 06:03:19 INFO - "builduid": "e5a2507dd92d48b2bfa6b334bb5b81f7", 06:03:19 INFO - "slavebuilddir": "test" 06:03:19 INFO - } 06:03:19 INFO - Found installer url https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2. 06:03:19 INFO - Running post-action listener: _resource_record_post_action 06:03:19 INFO - ##### 06:03:19 INFO - ##### Running download-and-extract step. 06:03:19 INFO - ##### 06:03:19 INFO - Running pre-action listener: _resource_record_pre_action 06:03:19 INFO - Running main action method: download_and_extract 06:03:19 INFO - mkdir: /builds/slave/test/build/tests 06:03:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:19 INFO - https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 06:03:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.test_packages.json 06:03:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.test_packages.json 06:03:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.test_packages.json 06:03:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.test_packages.json'}, attempt #1 06:03:20 INFO - Downloaded 1327 bytes. 06:03:20 INFO - Reading from file /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.test_packages.json 06:03:20 INFO - Using the following test package requirements: 06:03:20 INFO - {u'common': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip'], 06:03:20 INFO - u'cppunittest': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 06:03:20 INFO - u'firefox-48.0.en-US.linux-x86_64.cppunittest.tests.zip'], 06:03:20 INFO - u'gtest': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 06:03:20 INFO - u'firefox-48.0.en-US.linux-x86_64.gtest.tests.zip'], 06:03:20 INFO - u'jittest': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 06:03:20 INFO - u'jsshell-linux-x86_64.zip'], 06:03:20 INFO - u'mochitest': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 06:03:20 INFO - u'firefox-48.0.en-US.linux-x86_64.mochitest.tests.zip'], 06:03:20 INFO - u'mozbase': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip'], 06:03:20 INFO - u'reftest': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 06:03:20 INFO - u'firefox-48.0.en-US.linux-x86_64.reftest.tests.zip'], 06:03:20 INFO - u'talos': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 06:03:20 INFO - u'firefox-48.0.en-US.linux-x86_64.talos.tests.zip'], 06:03:20 INFO - u'web-platform': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 06:03:20 INFO - u'firefox-48.0.en-US.linux-x86_64.web-platform.tests.zip'], 06:03:20 INFO - u'xpcshell': [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', 06:03:20 INFO - u'firefox-48.0.en-US.linux-x86_64.xpcshell.tests.zip']} 06:03:20 INFO - Downloading packages: [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 06:03: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')]} 06:03:20 INFO - https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:03:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip 06:03:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip 06:03:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip 06:03:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 06:03:22 INFO - Downloaded 24236684 bytes. 06:03:22 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 06:03:22 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 06:03:24 INFO - Return code: 0 06:03:24 INFO - Downloading packages: [u'firefox-48.0.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 06:03:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:24 INFO - https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:03:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip 06:03:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip 06:03:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip 06:03:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 06:03:26 INFO - Downloaded 24236684 bytes. 06:03:26 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 06:03:26 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 06:03:27 INFO - Return code: 0 06:03:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:27 INFO - https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 06:03:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip 06:03:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip 06:03:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip 06:03:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 06:03:28 INFO - Downloaded 10840145 bytes. 06:03:28 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 06:03:28 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 06:03:28 INFO - Return code: 0 06:03:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:28 INFO - https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 06:03:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 06:03:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 06:03:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 06:03:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.tar.bz2'}, attempt #1 06:03:30 INFO - Downloaded 56002347 bytes. 06:03:30 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 06:03:30 INFO - mkdir: /builds/slave/test/properties 06:03:30 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 06:03:30 INFO - Writing to file /builds/slave/test/properties/build_url 06:03:30 INFO - Contents: 06:03:30 INFO - build_url:https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 06:03:30 INFO - Running post-action listener: _resource_record_post_action 06:03:30 INFO - Running post-action listener: set_extra_try_arguments 06:03:30 INFO - ##### 06:03:30 INFO - ##### Running populate-webroot step. 06:03:30 INFO - ##### 06:03:30 INFO - Running pre-action listener: _resource_record_pre_action 06:03:30 INFO - Running main action method: populate_webroot 06:03:30 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:03:30 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:03:30 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:03:30 INFO - '--tppagecycles', 06:03:30 INFO - '7'], 06:03:30 INFO - 'tests': ['tsvgm']}}, 06:03:30 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 06:03:30 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:03:30 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 06:03:30 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 06:03:30 INFO - 'tests': ['dromaeo_css', 'kraken']}, 06:03:30 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 06:03:30 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:03:30 INFO - 'talos_options': ['--disable-e10s'], 06:03:30 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:03:30 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:03:30 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:03:30 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:03:30 INFO - 'talos_options': ['--disable-e10s'], 06:03:30 INFO - 'tests': ['damp', 'tps']}, 06:03:30 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:03:30 INFO - 'tests': ['damp', 'tps']}, 06:03:30 INFO - 'g3': {'talos_options': ['--disable-e10s'], 06:03:30 INFO - 'tests': ['dromaeo_dom']}, 06:03:30 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:03:30 INFO - 'other': {'talos_options': ['--disable-e10s'], 06:03:30 INFO - 'tests': ['a11yr', 06:03:30 INFO - 'ts_paint', 06:03:30 INFO - 'tpaint', 06:03:30 INFO - 'sessionrestore', 06:03:30 INFO - 'sessionrestore_no_auto_restore', 06:03:30 INFO - 'tabpaint']}, 06:03:30 INFO - 'other-e10s': {'tests': ['a11yr', 06:03:30 INFO - 'ts_paint', 06:03:30 INFO - 'tpaint', 06:03:30 INFO - 'sessionrestore', 06:03:30 INFO - 'sessionrestore_no_auto_restore', 06:03:30 INFO - 'tabpaint']}, 06:03:30 INFO - 'other-e10s_l64': {'tests': ['a11yr', 06:03:30 INFO - 'ts_paint', 06:03:30 INFO - 'tpaint', 06:03:30 INFO - 'sessionrestore', 06:03:30 INFO - 'sessionrestore_no_auto_restore', 06:03:30 INFO - 'tabpaint']}, 06:03:30 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 06:03:30 INFO - 'ts_paint', 06:03:30 INFO - 'tpaint', 06:03:30 INFO - 'sessionrestore', 06:03:30 INFO - 'sessionrestore_no_auto_restore', 06:03:30 INFO - 'tabpaint']}, 06:03:30 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 06:03:30 INFO - 'tests': ['a11yr', 06:03:30 INFO - 'ts_paint', 06:03:30 INFO - 'tpaint', 06:03:30 INFO - 'sessionrestore', 06:03:30 INFO - 'sessionrestore_no_auto_restore', 06:03:30 INFO - 'tabpaint']}, 06:03:30 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 06:03:30 INFO - 'tests': ['a11yr', 06:03:30 INFO - 'ts_paint', 06:03:30 INFO - 'tpaint', 06:03:30 INFO - 'sessionrestore', 06:03:30 INFO - 'sessionrestore_no_auto_restore', 06:03:30 INFO - 'tabpaint']}, 06:03:30 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 06:03:30 INFO - 'tests': ['tsvgx', 06:03:30 INFO - 'tsvgr_opacity', 06:03:30 INFO - 'tart', 06:03:30 INFO - 'tscrollx', 06:03:30 INFO - 'cart']}, 06:03:30 INFO - 'svgr-e10s': {'tests': ['tsvgx', 06:03:30 INFO - 'tsvgr_opacity', 06:03:30 INFO - 'tart', 06:03:30 INFO - 'tscrollx', 06:03:30 INFO - 'cart']}, 06:03:30 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:03:30 INFO - 'talos_options': ['--disable-e10s'], 06:03:30 INFO - 'tests': ['tp5o']}, 06:03:30 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:03:30 INFO - 'tests': ['tp5o']}, 06:03:30 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:03:30 INFO - 'talos_options': ['--disable-e10s', 06:03:30 INFO - '--xperf_path', 06:03:30 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:03:30 INFO - 'tests': ['tp5n']}, 06:03:30 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:03:30 INFO - 'talos_options': ['--xperf_path', 06:03:30 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:03:30 INFO - 'tests': ['tp5n']}}, 06:03:30 INFO - 'talos.zip': {'path': '', 06:03:30 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:03:30 INFO - Running post-action listener: _resource_record_post_action 06:03:30 INFO - ##### 06:03:30 INFO - ##### Running create-virtualenv step. 06:03:30 INFO - ##### 06:03:30 INFO - Running pre-action listener: _resource_record_pre_action 06:03:30 INFO - Running main action method: create_virtualenv 06:03:30 INFO - Creating virtualenv /builds/slave/test/build/venv 06:03:30 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 06:03:30 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 06:03:31 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:03:31 INFO - Using real prefix '/usr' 06:03:31 INFO - New python executable in /builds/slave/test/build/venv/bin/python 06:03:31 INFO - Installing distribute.............................................................................................................................................................................................done. 06:03:33 INFO - Installing pip.................done. 06:03:33 INFO - Return code: 0 06:03:33 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 06:03: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')]} 06:03:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:03:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03: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')]} 06:03:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:03:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc1a75eaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x136b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14365a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c5410>, '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 0x14c6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14c67a0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:03: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', 'pip>=1.5'] in /builds/slave/test/build 06:03: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 pip>=1.5 06:03:33 INFO - Using env: {'DISPLAY': ':0', 06:03:33 INFO - 'HOME': '/home/cltbld', 06:03:33 INFO - 'LANG': 'en_US.UTF-8', 06:03:33 INFO - 'LANGUAGE': 'en_US:en', 06:03:33 INFO - 'LOGNAME': 'cltbld', 06:03:33 INFO - 'MAIL': '/var/mail/cltbld', 06:03:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:03:33 INFO - 'MOZ_NO_REMOTE': '1', 06:03:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:03:33 INFO - 'NO_EM_RESTART': '1', 06:03:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:03:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:03:33 INFO - 'PWD': '/builds/slave/test', 06:03:33 INFO - 'SHELL': '/bin/bash', 06:03:33 INFO - 'SHLVL': '1', 06:03:33 INFO - 'TERM': 'linux', 06:03:33 INFO - 'TMOUT': '86400', 06:03:33 INFO - 'USER': 'cltbld', 06:03:33 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 06:03:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:03:33 INFO - '_': '/tools/buildbot/bin/python'} 06:03:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:03:33 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 06:03:33 INFO - Cleaning up... 06:03:33 INFO - Return code: 0 06:03:33 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 06:03: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')]} 06:03:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:03:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03: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')]} 06:03:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:03:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03: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', '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 0x7fc1a75eaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x136b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14365a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c5410>, '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 0x14c6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14c67a0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:03: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', 'psutil>=0.7.1'] in /builds/slave/test/build 06:03: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 psutil>=0.7.1 06:03:33 INFO - Using env: {'DISPLAY': ':0', 06:03:33 INFO - 'HOME': '/home/cltbld', 06:03:33 INFO - 'LANG': 'en_US.UTF-8', 06:03:33 INFO - 'LANGUAGE': 'en_US:en', 06:03:33 INFO - 'LOGNAME': 'cltbld', 06:03:33 INFO - 'MAIL': '/var/mail/cltbld', 06:03:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:03:33 INFO - 'MOZ_NO_REMOTE': '1', 06:03:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:03:33 INFO - 'NO_EM_RESTART': '1', 06:03:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:03:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:03:33 INFO - 'PWD': '/builds/slave/test', 06:03:33 INFO - 'SHELL': '/bin/bash', 06:03:33 INFO - 'SHLVL': '1', 06:03:33 INFO - 'TERM': 'linux', 06:03:33 INFO - 'TMOUT': '86400', 06:03:33 INFO - 'USER': 'cltbld', 06:03:33 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 06:03:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:03:33 INFO - '_': '/tools/buildbot/bin/python'} 06:03:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:03:34 INFO - Downloading/unpacking psutil>=0.7.1 06:03:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 06:03:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:03:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:03:36 INFO - Installing collected packages: psutil 06:03:36 INFO - Running setup.py install for psutil 06:03:36 INFO - building 'psutil._psutil_linux' extension 06:03:36 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 06:03:36 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 06:03:36 INFO - building 'psutil._psutil_posix' extension 06:03:36 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 06:03:36 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 06:03:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:03:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:03:36 INFO - Successfully installed psutil 06:03:36 INFO - Cleaning up... 06:03:36 INFO - Return code: 0 06:03:36 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 06:03:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:03:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:03:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:36 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 0x7fc1a75eaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x136b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14365a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c5410>, '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 0x14c6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14c67a0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:03:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 06:03:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 06:03:36 INFO - Using env: {'DISPLAY': ':0', 06:03:36 INFO - 'HOME': '/home/cltbld', 06:03:36 INFO - 'LANG': 'en_US.UTF-8', 06:03:36 INFO - 'LANGUAGE': 'en_US:en', 06:03:36 INFO - 'LOGNAME': 'cltbld', 06:03:36 INFO - 'MAIL': '/var/mail/cltbld', 06:03:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:03:36 INFO - 'MOZ_NO_REMOTE': '1', 06:03:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:03:36 INFO - 'NO_EM_RESTART': '1', 06:03:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:03:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:03:36 INFO - 'PWD': '/builds/slave/test', 06:03:36 INFO - 'SHELL': '/bin/bash', 06:03:36 INFO - 'SHLVL': '1', 06:03:36 INFO - 'TERM': 'linux', 06:03:36 INFO - 'TMOUT': '86400', 06:03:36 INFO - 'USER': 'cltbld', 06:03:36 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 06:03:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:03:36 INFO - '_': '/tools/buildbot/bin/python'} 06:03:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:03:36 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 06:03: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 06:03: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 06:03: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 06:03: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 06:03: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 06:03: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 06:03:38 INFO - Downloading mozsystemmonitor-0.0.tar.gz 06:03:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:03:38 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 06:03:38 INFO - Installing collected packages: mozsystemmonitor 06:03:38 INFO - Running setup.py install for mozsystemmonitor 06:03:38 INFO - Successfully installed mozsystemmonitor 06:03:38 INFO - Cleaning up... 06:03:38 INFO - Return code: 0 06:03:38 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 06:03:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:03:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:03:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:38 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 0x7fc1a75eaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x136b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14365a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c5410>, '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 0x14c6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14c67a0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:03:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 06:03:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 06:03:38 INFO - Using env: {'DISPLAY': ':0', 06:03:38 INFO - 'HOME': '/home/cltbld', 06:03:38 INFO - 'LANG': 'en_US.UTF-8', 06:03:38 INFO - 'LANGUAGE': 'en_US:en', 06:03:38 INFO - 'LOGNAME': 'cltbld', 06:03:38 INFO - 'MAIL': '/var/mail/cltbld', 06:03:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:03:38 INFO - 'MOZ_NO_REMOTE': '1', 06:03:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:03:38 INFO - 'NO_EM_RESTART': '1', 06:03:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:03:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:03:38 INFO - 'PWD': '/builds/slave/test', 06:03:38 INFO - 'SHELL': '/bin/bash', 06:03:38 INFO - 'SHLVL': '1', 06:03:38 INFO - 'TERM': 'linux', 06:03:38 INFO - 'TMOUT': '86400', 06:03:38 INFO - 'USER': 'cltbld', 06:03:38 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 06:03:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:03:38 INFO - '_': '/tools/buildbot/bin/python'} 06:03:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:03:39 INFO - Downloading/unpacking blobuploader==1.2.4 06:03:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:41 INFO - Downloading blobuploader-1.2.4.tar.gz 06:03:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:03:41 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:03:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 06:03:41 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:03:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:41 INFO - Downloading docopt-0.6.1.tar.gz 06:03:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 06:03:41 INFO - Installing collected packages: blobuploader, requests, docopt 06:03:41 INFO - Running setup.py install for blobuploader 06:03:41 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:03:41 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 06:03:41 INFO - Running setup.py install for requests 06:03:42 INFO - Running setup.py install for docopt 06:03:42 INFO - Successfully installed blobuploader requests docopt 06:03:42 INFO - Cleaning up... 06:03:42 INFO - Return code: 0 06:03:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:03:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:03:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:03:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:42 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 0x7fc1a75eaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x136b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14365a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c5410>, '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 0x14c6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14c67a0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:03:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 06:03:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:03:42 INFO - Using env: {'DISPLAY': ':0', 06:03:42 INFO - 'HOME': '/home/cltbld', 06:03:42 INFO - 'LANG': 'en_US.UTF-8', 06:03:42 INFO - 'LANGUAGE': 'en_US:en', 06:03:42 INFO - 'LOGNAME': 'cltbld', 06:03:42 INFO - 'MAIL': '/var/mail/cltbld', 06:03:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:03:42 INFO - 'MOZ_NO_REMOTE': '1', 06:03:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:03:42 INFO - 'NO_EM_RESTART': '1', 06:03:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:03:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:03:42 INFO - 'PWD': '/builds/slave/test', 06:03:42 INFO - 'SHELL': '/bin/bash', 06:03:42 INFO - 'SHLVL': '1', 06:03:42 INFO - 'TERM': 'linux', 06:03:42 INFO - 'TMOUT': '86400', 06:03:42 INFO - 'USER': 'cltbld', 06:03:42 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 06:03:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:03:42 INFO - '_': '/tools/buildbot/bin/python'} 06:03:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:03:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:03:42 INFO - Running setup.py (path:/tmp/pip-jzaKlw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:03:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:03:42 INFO - Running setup.py (path:/tmp/pip-tCpGv8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:03:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:03:42 INFO - Running setup.py (path:/tmp/pip-gs_STg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:03:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:03:42 INFO - Running setup.py (path:/tmp/pip-qf1BUT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:03:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:03:42 INFO - Running setup.py (path:/tmp/pip-G5D4HO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:03:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:03:42 INFO - Running setup.py (path:/tmp/pip-YuQcYY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:03:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:03:43 INFO - Running setup.py (path:/tmp/pip-XKsjQa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:03:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:03:43 INFO - Running setup.py (path:/tmp/pip-d_4B_g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:03:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:03:43 INFO - Running setup.py (path:/tmp/pip-9_BNSh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:03:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:03:43 INFO - Running setup.py (path:/tmp/pip-_H24L9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:03:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:03:43 INFO - Running setup.py (path:/tmp/pip-tdDeb8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:03:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:03:43 INFO - Running setup.py (path:/tmp/pip-2Z2QGs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:03:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:03:43 INFO - Running setup.py (path:/tmp/pip-QcH6Ib-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:03:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:03:43 INFO - Running setup.py (path:/tmp/pip-nAXtGj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:03:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:03:43 INFO - Running setup.py (path:/tmp/pip-P31nt7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:03:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:03:43 INFO - Running setup.py (path:/tmp/pip-CFN30Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:03:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:03:43 INFO - Running setup.py (path:/tmp/pip-KdnFaS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:03:43 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 06:03:43 INFO - Running setup.py install for manifestparser 06:03:43 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 06:03:43 INFO - Running setup.py install for mozcrash 06:03:44 INFO - Running setup.py install for mozdebug 06:03:44 INFO - Running setup.py install for mozdevice 06:03:44 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 06:03:44 INFO - Installing dm script to /builds/slave/test/build/venv/bin 06:03:44 INFO - Running setup.py install for mozfile 06:03:44 INFO - Running setup.py install for mozhttpd 06:03:44 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 06:03:44 INFO - Running setup.py install for mozinfo 06:03:44 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 06:03:44 INFO - Running setup.py install for mozInstall 06:03:44 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 06:03:44 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 06:03:44 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 06:03:44 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 06:03:44 INFO - Running setup.py install for mozleak 06:03:44 INFO - Running setup.py install for mozlog 06:03:44 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 06:03:44 INFO - Running setup.py install for moznetwork 06:03:44 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 06:03:44 INFO - Running setup.py install for mozprocess 06:03:45 INFO - Running setup.py install for mozprofile 06:03:45 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 06:03:45 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 06:03:45 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 06:03:45 INFO - Running setup.py install for mozrunner 06:03:45 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 06:03:45 INFO - Running setup.py install for mozscreenshot 06:03:45 INFO - Running setup.py install for moztest 06:03:45 INFO - Running setup.py install for mozversion 06:03:45 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 06:03:45 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 06:03:45 INFO - Cleaning up... 06:03:45 INFO - Return code: 0 06:03:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:03:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:03:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:03:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:45 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 0x7fc1a75eaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x136b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14365a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c5410>, '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 0x14c6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14c67a0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:03:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 06:03:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:03:45 INFO - Using env: {'DISPLAY': ':0', 06:03:45 INFO - 'HOME': '/home/cltbld', 06:03:45 INFO - 'LANG': 'en_US.UTF-8', 06:03:45 INFO - 'LANGUAGE': 'en_US:en', 06:03:45 INFO - 'LOGNAME': 'cltbld', 06:03:45 INFO - 'MAIL': '/var/mail/cltbld', 06:03:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:03:45 INFO - 'MOZ_NO_REMOTE': '1', 06:03:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:03:45 INFO - 'NO_EM_RESTART': '1', 06:03:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:03:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:03:45 INFO - 'PWD': '/builds/slave/test', 06:03:45 INFO - 'SHELL': '/bin/bash', 06:03:45 INFO - 'SHLVL': '1', 06:03:45 INFO - 'TERM': 'linux', 06:03:45 INFO - 'TMOUT': '86400', 06:03:45 INFO - 'USER': 'cltbld', 06:03:45 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 06:03:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:03:45 INFO - '_': '/tools/buildbot/bin/python'} 06:03:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:03:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:03:45 INFO - Running setup.py (path:/tmp/pip-3hCoHL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:03:45 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 06:03:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:03:45 INFO - Running setup.py (path:/tmp/pip-uUCF3W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:03:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:03:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:03:45 INFO - Running setup.py (path:/tmp/pip-ENN1Lx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:03:46 INFO - Running setup.py (path:/tmp/pip-0Q7R2v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:03:46 INFO - Running setup.py (path:/tmp/pip-8Gsnwl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:03:46 INFO - Running setup.py (path:/tmp/pip-BHsUIh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:03:46 INFO - Running setup.py (path:/tmp/pip-EXIBS6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:03:46 INFO - Running setup.py (path:/tmp/pip-svHg2t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:03:46 INFO - Running setup.py (path:/tmp/pip-3W9_Yk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:03:46 INFO - Running setup.py (path:/tmp/pip-BL_TEk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:03:46 INFO - Running setup.py (path:/tmp/pip-dPvfOs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:03:46 INFO - Running setup.py (path:/tmp/pip-3n6jhl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:03:46 INFO - Running setup.py (path:/tmp/pip-08csRI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:03:46 INFO - Running setup.py (path:/tmp/pip-0_fNKf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:03:46 INFO - Running setup.py (path:/tmp/pip-X7BzCr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:03:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 06:03:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:03:46 INFO - Running setup.py (path:/tmp/pip-9KHSCh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:03:47 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 06:03:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:03:47 INFO - Running setup.py (path:/tmp/pip-tsR08r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:03:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 06:03:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:03:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:03:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 06:03:47 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:03:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:03:47 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:03:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:48 INFO - Downloading blessings-1.6.tar.gz 06:03:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 06:03:49 INFO - Installing collected packages: blessings 06:03:49 INFO - Running setup.py install for blessings 06:03:49 INFO - Successfully installed blessings 06:03:49 INFO - Cleaning up... 06:03:49 INFO - Return code: 0 06:03:49 INFO - Done creating virtualenv /builds/slave/test/build/venv. 06:03:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:03:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:03:49 INFO - Reading from file tmpfile_stdout 06:03:49 INFO - Current package versions: 06:03:49 INFO - argparse == 1.2.1 06:03:49 INFO - blessings == 1.6 06:03:49 INFO - blobuploader == 1.2.4 06:03:49 INFO - docopt == 0.6.1 06:03:49 INFO - manifestparser == 1.1 06:03:49 INFO - mozInstall == 1.12 06:03:49 INFO - mozcrash == 0.17 06:03:49 INFO - mozdebug == 0.1 06:03:49 INFO - mozdevice == 0.48 06:03:49 INFO - mozfile == 1.2 06:03:49 INFO - mozhttpd == 0.7 06:03:49 INFO - mozinfo == 0.9 06:03:49 INFO - mozleak == 0.1 06:03:49 INFO - mozlog == 3.1 06:03:49 INFO - moznetwork == 0.27 06:03:49 INFO - mozprocess == 0.22 06:03:49 INFO - mozprofile == 0.28 06:03:49 INFO - mozrunner == 6.11 06:03:49 INFO - mozscreenshot == 0.1 06:03:49 INFO - mozsystemmonitor == 0.0 06:03:49 INFO - moztest == 0.7 06:03:49 INFO - mozversion == 1.4 06:03:49 INFO - psutil == 3.1.1 06:03:49 INFO - requests == 1.2.3 06:03:49 INFO - wsgiref == 0.1.2 06:03:49 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:03:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:03:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:03:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:49 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 0x7fc1a75eaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x136b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14365a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c5410>, '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 0x14c6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14c67a0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:03:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 06:03:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:03:49 INFO - Using env: {'DISPLAY': ':0', 06:03:49 INFO - 'HOME': '/home/cltbld', 06:03:49 INFO - 'LANG': 'en_US.UTF-8', 06:03:49 INFO - 'LANGUAGE': 'en_US:en', 06:03:49 INFO - 'LOGNAME': 'cltbld', 06:03:49 INFO - 'MAIL': '/var/mail/cltbld', 06:03:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:03:49 INFO - 'MOZ_NO_REMOTE': '1', 06:03:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:03:49 INFO - 'NO_EM_RESTART': '1', 06:03:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:03:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:03:49 INFO - 'PWD': '/builds/slave/test', 06:03:49 INFO - 'SHELL': '/bin/bash', 06:03:49 INFO - 'SHLVL': '1', 06:03:49 INFO - 'TERM': 'linux', 06:03:49 INFO - 'TMOUT': '86400', 06:03:49 INFO - 'USER': 'cltbld', 06:03:49 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 06:03:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:03:49 INFO - '_': '/tools/buildbot/bin/python'} 06:03:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:03:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 06:03:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 06:03:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 06:03:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 06:03:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 06:03:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 06:03:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 06:03:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 06:03:49 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 06:03:49 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 06:03:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 06:03:49 INFO - Cleaning up... 06:03:49 INFO - Return code: 0 06:03:49 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 06:03:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:03:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:03:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc1a75eaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x136b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14365a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c5410>, '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 0x14c6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14c67a0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:03:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 06:03:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 06:03:49 INFO - Using env: {'DISPLAY': ':0', 06:03:49 INFO - 'HOME': '/home/cltbld', 06:03:49 INFO - 'LANG': 'en_US.UTF-8', 06:03:49 INFO - 'LANGUAGE': 'en_US:en', 06:03:49 INFO - 'LOGNAME': 'cltbld', 06:03:49 INFO - 'MAIL': '/var/mail/cltbld', 06:03:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:03:49 INFO - 'MOZ_NO_REMOTE': '1', 06:03:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:03:49 INFO - 'NO_EM_RESTART': '1', 06:03:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:03:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:03:49 INFO - 'PWD': '/builds/slave/test', 06:03:49 INFO - 'SHELL': '/bin/bash', 06:03:49 INFO - 'SHLVL': '1', 06:03:49 INFO - 'TERM': 'linux', 06:03:49 INFO - 'TMOUT': '86400', 06:03:49 INFO - 'USER': 'cltbld', 06:03:49 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 06:03:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:03:49 INFO - '_': '/tools/buildbot/bin/python'} 06:03:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:03:49 INFO - Downloading/unpacking jsonschema 06:03:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:51 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 06:03:51 INFO - Downloading/unpacking functools32 (from jsonschema) 06:03:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:51 INFO - Downloading functools32-3.2.3-2.tar.gz 06:03:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 06:03:52 INFO - warning: no files found matching '*.txt' 06:03:52 INFO - no previously-included directories found matching 'build' 06:03:52 INFO - no previously-included directories found matching 'dist' 06:03:52 INFO - no previously-included directories found matching '.git*' 06:03:52 INFO - Installing collected packages: jsonschema, functools32 06:03:52 INFO - Running setup.py install for functools32 06:03:52 INFO - warning: no files found matching '*.txt' 06:03:52 INFO - no previously-included directories found matching 'build' 06:03:52 INFO - no previously-included directories found matching 'dist' 06:03:52 INFO - no previously-included directories found matching '.git*' 06:03:52 INFO - Successfully installed jsonschema functools32 06:03:52 INFO - Cleaning up... 06:03:52 INFO - Return code: 0 06:03:52 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 06:03:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:03:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:03:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:03:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:03:52 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 0x7fc1a75eaf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x136b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14365a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c5410>, '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 0x14c6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14c67a0>, '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': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:03:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 06:03:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 06:03:52 INFO - Using env: {'DISPLAY': ':0', 06:03:52 INFO - 'HOME': '/home/cltbld', 06:03:52 INFO - 'LANG': 'en_US.UTF-8', 06:03:52 INFO - 'LANGUAGE': 'en_US:en', 06:03:52 INFO - 'LOGNAME': 'cltbld', 06:03:52 INFO - 'MAIL': '/var/mail/cltbld', 06:03:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:03:52 INFO - 'MOZ_NO_REMOTE': '1', 06:03:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:03:52 INFO - 'NO_EM_RESTART': '1', 06:03:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:03:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:03:52 INFO - 'PWD': '/builds/slave/test', 06:03:52 INFO - 'SHELL': '/bin/bash', 06:03:52 INFO - 'SHLVL': '1', 06:03:52 INFO - 'TERM': 'linux', 06:03:52 INFO - 'TMOUT': '86400', 06:03:52 INFO - 'USER': 'cltbld', 06:03:52 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 06:03:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:03:52 INFO - '_': '/tools/buildbot/bin/python'} 06:03:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:03:52 INFO - Downloading/unpacking flake8 06:03:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:54 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 06:03:54 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 06:03:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:54 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 06:03:54 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 06:03:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:54 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 06:03:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:03:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:03:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:03:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 06:03:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 06:03:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 06:03:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 06:03:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 06:03:55 INFO - no previously-included directories found matching 'docs/_build' 06:03:55 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 06:03:55 INFO - Running setup.py install for pep8 06:03:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 06:03:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 06:03:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 06:03:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 06:03:55 INFO - no previously-included directories found matching 'docs/_build' 06:03:55 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 06:03:55 INFO - Successfully installed flake8 mccabe pyflakes pep8 06:03:55 INFO - Cleaning up... 06:03:55 INFO - Return code: 0 06:03:55 INFO - Running post-action listener: _resource_record_post_action 06:03:55 INFO - Running post-action listener: _start_resource_monitoring 06:03:55 INFO - Starting resource monitoring. 06:03:55 INFO - ##### 06:03:55 INFO - ##### Running install step. 06:03:55 INFO - ##### 06:03:55 INFO - Running pre-action listener: _resource_record_pre_action 06:03:55 INFO - Running main action method: install 06:03:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:03:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:03:55 INFO - Reading from file tmpfile_stdout 06:03:55 INFO - Detecting whether we're running mozinstall >=1.0... 06:03:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 06:03:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 06:03:55 INFO - Reading from file tmpfile_stdout 06:03:55 INFO - Output received: 06:03:55 INFO - Usage: mozinstall [options] installer 06:03:55 INFO - Options: 06:03:55 INFO - -h, --help show this help message and exit 06:03:55 INFO - -d DEST, --destination=DEST 06:03:55 INFO - Directory to install application into. [default: 06:03:55 INFO - "/builds/slave/test"] 06:03:55 INFO - --app=APP Application being installed. [default: firefox] 06:03:55 INFO - mkdir: /builds/slave/test/build/application 06:03:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 06:03:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 06:04:09 INFO - Reading from file tmpfile_stdout 06:04:09 INFO - Output received: 06:04:09 INFO - /builds/slave/test/build/application/firefox/firefox 06:04:09 INFO - Running post-action listener: _resource_record_post_action 06:04:09 INFO - ##### 06:04:09 INFO - ##### Running run-tests step. 06:04:09 INFO - ##### 06:04:09 INFO - Running pre-action listener: _resource_record_pre_action 06:04:09 INFO - Running main action method: run_tests 06:04:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 06:04:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 06:04:09 INFO - Python 2.7.3 06:04:09 INFO - Return code: 0 06:04:09 INFO - grabbing minidump binary from tooltool 06:04:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:09 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 0x14c5410>, '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 0x14c6310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14c67a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 06:04:09 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 06:04:09 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 06:04:09 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 06:04:09 INFO - Return code: 0 06:04:09 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 06:04:09 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 06:04:09 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 06:04:09 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 06:04:09 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 06:04:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 06:04:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 06:04:10 INFO - Return code: 0 06:04:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-033', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 06:04:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-033 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 06:04:10 INFO - Using env: {'DISPLAY': ':0', 06:04:10 INFO - 'HOME': '/home/cltbld', 06:04:10 INFO - 'LANG': 'en_US.UTF-8', 06:04:10 INFO - 'LANGUAGE': 'en_US:en', 06:04:10 INFO - 'LOGNAME': 'cltbld', 06:04:10 INFO - 'MAIL': '/var/mail/cltbld', 06:04:10 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 06:04:10 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 06:04:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:04:10 INFO - 'MOZ_NO_REMOTE': '1', 06:04:10 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 06:04:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:04:10 INFO - 'NO_EM_RESTART': '1', 06:04:10 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:04:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:04:10 INFO - 'PWD': '/builds/slave/test', 06:04:10 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 06:04:10 INFO - 'SHELL': '/bin/bash', 06:04:10 INFO - 'SHLVL': '1', 06:04:10 INFO - 'TERM': 'linux', 06:04:10 INFO - 'TMOUT': '86400', 06:04:10 INFO - 'USER': 'cltbld', 06:04:10 INFO - 'XDG_SESSION_COOKIE': 'edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467', 06:04:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:04:10 INFO - '_': '/tools/buildbot/bin/python'} 06:04:10 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-033', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 06:04:10 INFO - mozversion application_buildid: 20160701030522 06:04:10 INFO - mozversion application_changeset: 9512f571459bbc816dda70d2a554cad8e848e67e 06:04:10 INFO - mozversion application_display_name: Firefox 06:04:10 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 06:04:10 INFO - mozversion application_name: Firefox 06:04:10 INFO - mozversion application_remotingname: firefox 06:04:10 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 06:04:10 INFO - mozversion application_vendor: Mozilla 06:04:10 INFO - mozversion application_version: 48.0 06:04:10 INFO - mozversion platform_buildid: 20160701030522 06:04:10 INFO - mozversion platform_changeset: 9512f571459bbc816dda70d2a554cad8e848e67e 06:04:10 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 06:04:10 INFO - mozversion platform_version: 48.0 06:04:10 INFO - using testdate: 1467378250 06:04:10 INFO - actual date: 1467378250 06:04:10 INFO - starting webserver on 'localhost:58907' 06:04:10 INFO - SUITE-START | Running 2 tests 06:04:10 INFO - TEST-START | dromaeo_css 06:04:10 INFO - operating with platform_type : linux_ 06:04:10 INFO - Initialising browser for dromaeo_css test... 06:04:10 INFO - TEST-INFO | started process 6180 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHvr5X0/profile http://localhost:58907/getInfo.html) 06:04:15 INFO - PROCESS | 6180 | __metrics Screen width/height:1600/1200 06:04:15 INFO - PROCESS | 6180 | colorDepth:24 06:04:15 INFO - PROCESS | 6180 | Browser inner width/height: 1024/697 06:04:15 INFO - PROCESS | 6180 | __metrics 06:04:16 ERROR - PROCESS | 6180 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 06:04:17 INFO - TEST-INFO | 6180: exit 0 06:04:17 INFO - Browser initialized. 06:04:17 INFO - Running cycle 1/1 for dromaeo_css test... 06:04:17 INFO - TEST-INFO | started process 6270 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHvr5X0/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:04:28 INFO - PROCESS | 6270 | RSS: Main: 139739136 06:04:28 INFO - PROCESS | 6270 | 06:05:20 INFO - PROCESS | 6270 | 1467378320357 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 06:07:27 INFO - PROCESS | 6270 | Cycle 1(1): loaded http://localhost:58907/tests/dromaeo/cssquery-dojo.html (next: http://localhost:58907/tests/dromaeo/cssquery-ext.html) 06:07:28 INFO - PROCESS | 6270 | RSS: Main: 249188352 06:07:28 INFO - PROCESS | 6270 | 06:10:30 INFO - PROCESS | 6270 | Cycle 1(1): loaded http://localhost:58907/tests/dromaeo/cssquery-ext.html (next: http://localhost:58907/tests/dromaeo/cssquery-jquery.html) 06:10:31 INFO - PROCESS | 6270 | RSS: Main: 222552064 06:10:31 INFO - PROCESS | 6270 | 06:13:33 INFO - PROCESS | 6270 | Cycle 1(1): loaded http://localhost:58907/tests/dromaeo/cssquery-jquery.html (next: http://localhost:58907/tests/dromaeo/cssquery-mootools.html) 06:13:33 INFO - PROCESS | 6270 | RSS: Main: 225619968 06:13:33 INFO - PROCESS | 6270 | 06:16:35 INFO - PROCESS | 6270 | Cycle 1(1): loaded http://localhost:58907/tests/dromaeo/cssquery-mootools.html (next: http://localhost:58907/tests/dromaeo/cssquery-prototype.html) 06:16:36 INFO - PROCESS | 6270 | RSS: Main: 219189248 06:16:36 INFO - PROCESS | 6270 | 06:19:38 INFO - PROCESS | 6270 | Cycle 1(1): loaded http://localhost:58907/tests/dromaeo/cssquery-prototype.html (next: http://localhost:58907/tests/dromaeo/cssquery-yui.html) 06:19:39 INFO - PROCESS | 6270 | RSS: Main: 210149376 06:19:39 INFO - PROCESS | 6270 | 06:22:41 INFO - PROCESS | 6270 | Cycle 1(1): loaded http://localhost:58907/tests/dromaeo/cssquery-yui.html (next: http://localhost:58907/tests/dromaeo/cssquery-dojo.html) 06:22:41 INFO - PROCESS | 6270 | RSS: Main: 253923328 06:22:41 INFO - PROCESS | 6270 | 06:22:41 INFO - PROCESS | 6270 | __start_tp_report 06:22:41 INFO - PROCESS | 6270 | _x_x_mozilla_page_load 06:22:41 INFO - PROCESS | 6270 | _x_x_mozilla_page_load_details 06:22:41 INFO - PROCESS | 6270 | |i|pagename|runs| 06:22:41 INFO - PROCESS | 6270 | |0;dojo.html;3292.1440425489373;3314.701676849085;3322.2192784695594;3324.318514704486;3365.5961284645846;5546.445355464457;5554.555635549156;5572.192032155335;5588.608797384175;5589.580781441393;5571.665700057999;5595.552355811536;5604.075327570956;5607.495325420711;5653.802116925908;4980.900381992376;4999.0501804657;5048.9495105048845;5132.563732082777;5167.819126330579;5027.899442011158;5132.97433512832;5142.768575414116;5161.76772045257;5166.302549155854;5110.897782044357;5144.4083930348115;5149.613778966574;5157.871053223681;5162.380514338266;5123.180291153416;5131.7434128293435;5158.3552055993005;5189.117849965515;5218.504242096995;4881.8535443936735;4985.925211121836;5049.116404629175;5061.696298222082;5070.3915530136255;5394.541463975527;5403.378611459693;5415.404305526389;5419.674819510842;5442.428545002796;5881.441263080001;5888.499477544414;5889.558283128739;5891.410858914117;5896.056630939029;5871.412858714094;5976.252968378953;6026.758929642809;6032.577719559633;6038.758449662008;5572.693501857396;5586.022446071921;5589.105743081128;5589.357223919261;5589.413111623302;6080.3106873460165;6084.574079814459;6087.086936959491;6109.114178444101;6114.205153330038;5772.9711351442975;5793.188953546507;5823.301203855564;5860.560457965669;5860.648361098348;5895.587308888336;5931.7923872665115;5938.346781853993;5939.70301484924;5985.191999080069;5843.415658434207;5853.5317174625925;5956.7319470623925;5959.1657167995645;5972.611780234271;6017.729202185912;6025.397460253939;6027.698615069229;6031.185789918305;6060.636361818217;4562.110388474216;4583.702059366131;4595.885102872455;4597.494275629678;4618.538146185355;3999.0402303446963;4042.5957404259925;4066.898327541835;4107.424960505532;4131.153113611703;5637.548996080303;5659.660420374708;5663.46197111282;5663.546916246691;5675.971620141873;5938.168656388109;5942.138389933435;5942.494887934487;5942.58401911862;5948.137520059568;5613.410591887793;5641.661500309912;5723.685197314105;5794.159846822187;5803.506701930383;5028.773705183203;5076.873078173001;5079.390473143247;5080.77136528857;5085.1355269604255;6223.657698826518;6228.159198508234;6232.626042437469;6236.719347629368;6236.906446403307;5867.970660146757;5929.080992446177;5990;6001.639901605918;6020.157177994996;6182.165407669907;6210.906836397367;6225.470834979077;6233.470155036873;6241.282252540835;5853.1220316952795;5870.559708022;5881.882362352643;5883.294004719461;5917.467427931507;5967.46292833647;5996.340402555803;6014.548908831767;6027.78902738402;6073.0283154695035;5804.245448091721;5828.475437210672;5852.326982397079;5860.912086318794;5882.470577648032;5728.770849166153;5872.677002764718;5876.324222714443;5876.735546900314;5878.441548052928;5709.314882214161;5712.942870571241;5724.74238659253;5736.282964629421;5760.740766665426;5874.706264686834;5876.882462350643;5877.294724633071;5883.323417806836;5890.823275301748;5568.16477528374;5702.173184888251;5754.05058165398;5787.074068149076;5798.884022319446 06:22:41 INFO - PROCESS | 6270 | |1;ext.html;610.8869859076071;648.8280605639507;661.5336187987466;662.5825729790231;673.501608809481;32449.188770280725;33224.83387583062;33252.16869578256;33316.833415832945;40342.59657403432;43067.35398969018;43567;43617.34573981385;43719.344209836876;43776.56223437765;8779.912200877989;8993.325500587449;8994.415363001417;8998.910010899905;9000.954995225014;8346.207110324509;8788.692395766118;10599.629012984547;10880.727981800479;10902.291351062195;10676.946615266912;10700.78598428031;10759.031687148155;10769.407682577455;10769.676909692722;10605.575776968912;10659.78680426395;10702.304350217211;10712.625058122929;10716.249862509667;10410.895891041144;10505.894941050568;10518.894811051869;10532.736681582945;10534;44234.55765442336;44685.55314446879;44746;44787.10425791499;44844.103117937455;3886.164474637938;4007.519097708294;4014.1770936957855;4087.6116768906904;4162.7502349859105;33701;34346.14134646629;34431.48352774711;34443.65556344455;34793.13017174566;4349.586789255016;4586.816527338902;4659.603933665642;4660.906781864378;4667.6265898728025;334716;336172;336740;336831.99999999756;336833;39441.60558394379;40418.39372409416;40428.393574096415;64841;65782;37629.81185094057;37722;37741.62258377436;37824.243515130096;37843.4323485148;16991.49025529236;17198.656026879642;17200;17238.913805430893;17264.74102888458;13526.661833454045;14434.566962991126;14511.492097776527;14521.491747788778;14649.560513184622;9169.08309169091;9186.448813071238;9240.07599240084;9241.21449676785;9248;3452.9654703452643;3470.9479357809655;3508.736844736655;3519.771214871025;3584.766990145632;1116.977965161884;1140.663504266227;1163.1160318158093;1235.857876344214;1277.1698396042461;32179.839100804813;33084.834575826964;33534.8323258387;33865;33869.66130338714;1222.535436534129;1241.205628397826;1251.2367455851922;1276.6106337566946;1333.8666133386585;17655.823441765675;17899.642007159782;18008.09959502046;18030.412383962674;18241;514142;521475;521537;521566;522483;63079.6846015767;63142.36857631457;63197.420064497834;63797.36202638007;63842.68078659577;1460;1502.947396841127;1505.9247037648074;1555.416718730476;1620.181808186858;30642.540361895037;31173.688263117077;31603.36793264168;32065;32286;46850;61994.38005619886;63726.362736372044;63763.6811815938;63858.68070659617;342320;345268;346952;347938;348606;39749.80125099356;42508.36237456379;47932.5206747928;49890;50182.247266291764;48990;49304.506954929995;49357;49830.501694984036;49885.750571246914;39113.41329879997;40046;40170.59829401669;41084.79457602693;41502.584974149875;38475.230495389376;39697;39703.80148099241;40201;40515.1896962065;45808.541914580426;46633;46787;47167.76416118035;47445.05109897852;38545.61454385532;39656.801715991234;39700.80149599234;40211.195776084896;40289;30402.239944000692;30708.385832282784;30732.907721412885;30915;31159.53260701046 06:22:41 INFO - PROCESS | 6270 | |2;jquery.html;422.4782393743728;424.7366632687734;434.3788382612864;437.3221506664671;445.6523911349147;18767;18968.810311896876;19254.903725481352;19440.80559194411;19470.805291947094;18942.526436839053;19068.141933612987;19995.800041999577;20078.397648070582;20080.196792128332;5661.688607126616;5663.555793272731;5957.195778569902;5961.135635332874;5970.462658360747;4330.84842030529;5865.501432378253;5923.703814809264;6172.938270617304;6472.9029064564065;6432.77485288015;6446.677666116699;6453.128827608283;6459.6447195404235;6471.223453185625;5632.35227948785;5829.154772557998;5896.292444906617;5902.380250073767;6419.101325814389;4060.8781736547658;5629.324481062258;5691.946989806899;5720.971395143039;5895.852603684899;14172.220527870963;14245.64385890361;14341.56975290743;14457.132572045606;14458.783118253235;2453.914113006054;2520.3699075231193;2555.3228394475477;2583.702874169457;2650.271175426754;13793.172409655352;14531.78202326966;14548.127112373186;15109.320080596399;15665.765013524806;2014.0835919656522;2045.3557129504159;2110.6517424624917;2122.6603743400983;2198.8021078103047;78856;79351.60324198342;81409.59295203545;81949.59025204895;82401;11158.437818705388;11485.483153258123;11624.825627615592;11684.415779211005;11729.472173752201;16210.67578648444;16335.591610209602;16362.672746545002;16372.754408683879;16430.589235268973;8956.417832840974;9047.954760226157;9103.90896091044;9148.908510914938;9212.447253164832;8869.157430044135;8886.24466920306;8925.553722313858;9030.051844556358;9077.77305567366;4956.10790057793;4965.875853103701;4981.203007518852;5065.898682026339;5112.054269960069;1844.981550184481;1928.2576208159678;2018.5861898310811;2027.7363942687357;2041.8162365387186;992.2161492421051;1053.1101219469535;1062.2458054781036;1133.586241022021;1137.4767606900753;19512.512187195432;19535.902320488305;19672.21311147538;19771.30800422007;19907.203711851653;1027.106417416852;1066.626680661762;1076.445630500293;1123.5000424811044;1153.7519433321877;10882.945585272022;11095.389753563632;11137.777244455065;11194.888051119384;11246.49390777417;483332;493632;495353;496078;502189;89591;91226.54386728157;91859.54070229606;93653.53173234226;93672.53163734273;1107.092184408777;1125.4091601909063;1133.8242572401125;1138.7494751154898;1142.5486932661552;17086.18003116379;17599;17602.471925842245;17607;17963.371282005068;38981.6101838978;39353.80323098366;40274.59725402708;40788.388174178006;41019.589804101575;59231;59651.40348596458;60076.39923600883;60726.39273607384;61335.38664613297;8705.216530512283;8984.375000000115;8984.910150898408;9150.633974641207;9232.076792320715;9694.85457718149;13177.143485673401;13233.602991910258;13530.594082177551;13617.79573306421;11823.645290641294;11873.584424545099;11891.82162267584;11900.821487677866;11958.760824783629;11432.828507572227;11433.485493152995;11897.881021190024;11934.22427542207;12162.087843411957;11770.419338533342;11788.587399440978;12020.63938081859;12223.327716975651;12517.687057823627;8785.165409286108;8913.55432228399;8933.865992010255;9072.95463522678;9096.408733432305;11920.165588409074;12018.519259229533;12111.333876636869;12144.878551214375;12241.755164896831 06:22:41 INFO - PROCESS | 6270 | |3;mootools.html;1403.2913378743733;1561.39105748758;1564.2178910544728;1771.627958128793;1880.8119188081193;8314.501129932201;8527.91472085279;8562.100979397159;8562.143785621434;8570.957145214274;8233.588320583976;8425.36809739269;8426.536540490286;8428;8438.704645337415;2420.322309753263;2451.8528888266674;2454.16558370155;2454.521368333176;2454.6931633545805;2425.9696927568457;2507.7743003129713;2521.205820166642;2523.116909081825;2534.3790771261065;2436.488337449138;2454.312792418126;2461.113998960373;2461.126300163443;2471.851688898672;2414.5170965806733;2428.9271321860374;2445.76765207305;2473.8763061846835;2475.0223661653545;2470.8641024743633;2492.9002839886384;2512.170983575416;2513.2711513661015;2529.924102276916;8330.166983301682;8513.233808957224;8547.102554231778;8556.358273129541;8567;5305.575553955674;5419.756110974976;5432.565394768409;5433;5437.510624043855;3428.5371474850826;3467.6185619581825;3472.965270347315;3505.071156143624;3518.2084031093054;1185.851768528934;1186.6084192216547;1202.615163147793;1222.8288039674364;1244.8941839943616;11758.294502329802;12123.818142727954;12165.756684866341;12171.2697238166;12201.389930503528;4309;4414.726415895816;4544.909101817945;4606.861794146181;4610.538946105363;9745;9802.313838031412;9818.754531136636;9828.4102953823;9835.114839664464;5155.072087024371;5186.170212765939;5195.792168313225;5198.2722418861385;5201.765920533585;4343.82624695015;4368.956310436855;4464.352668862996;4666.253399456071;4850.417949846041;3877.65101140893;3912.8630497932436;3980.1840622672285;4032.7580345179385;4045.5347635021762;1211.1824518450012;1211.4487908001838;1215.7386161975041;1222.2971791220084;1229.4959066782756;1079.5843600213818;1083.534080345459;1092.4264761000538;1112.6550769261555;1123.2586492914636;6097.237845269341;6116.480099191618;6238.75044998195;6257.7184026718905;6258.311585725566;1025.190099821133;1025.477006726575;1036.8859425463193;1050.9001644843727;1056.5773690523852;4265.680073994463;4333.7833108345085;4335.588119128678;4340.717853339523;4344;10246.846297305547;10481.371117732808;10645.78708425827;10669.19981001428;10697.893021069689;10539.42033188182;10570.947145264377;10842.186835987333;10858.511366988505;10886.183536234814;7912.248336408032;8045.517268963764;8068.233517815798;8165.183481651906;8176.3458923286;5867.882642347044;6155.630082418212;6184.8763024738355;6203.4416902479;6271.529635277464;9614.423134611945;9689.224862011164;9778.41329520231;9893.703188904345;9900.504974751379;9793.951030244803;9855.162311203629;9914.30599858003;10291.53688084023;10300.175985920958;7511.699532018658;7600.619969001638;7707.499012564165;7832.138464768985;7837.098733645704;8312.83374332522;8325.500469971821;8332.916670833214;8367.832643347221;8388.412811103408;7493.138289096823;7532.359749421142;7555.9244407555225;7695.769126926201;7826.530408175528;7448.366888814295;7526.962365188139;7559.395248380227;7574.545527268381;7648.694052237848;6914.135733033371;6921.2732663069655;6933.1333583302085;6972.233054363915;6988.161420629557;5088.236764485357;5157.871053223699;5243.161094225058;5284.41871394154;5291.100512912891;5368.3557973041925;5415.4313797050745;5482.506574408322;5495.5878309127775;5497.340319161726 06:22:41 INFO - PROCESS | 6270 | |4;prototype.html;349.6486031538302;350.5775540473729;356.1061735045038;358.34244161962795;361.15309598990376;6098.4511393974535;6101.664408457538;6103.816885493442;6133.723982420791;6161.661108639023;6106.992346262872;6141.293751218611;6152.707931334425;6208.720607572659;6217.5958562693395;4491.393661855648;4596.471405788327;4722.50413706561;4741.075490279397;4741.075490279397;4705.458872229703;4705.55297246761;4727.456342520602;4737.265723812815;4758.643101767364;4505.707129036618;4663.2538793793;4663.347131401607;4680.812767489297;4688.156131896258;4494.640428765723;4622.214223581982;4631.814727410916;4651.86044418668;4677.953220467786;4083.1629515949157;4096.32410652242;4100.261952848486;4103.322951712964;4107.219628270649;5885.352611212763;5905.852353691149;5906;5911.024680927641;5917.467427931464;5429.158480435539;5440.700761458118;5441.428649991773;5447.4824891635235;5451.809186678487;6459.418652321314;6462;6464.838379040514;6484.870302593922;6489.70796314167;4514.977425112854;4633.675642705012;4638.9536104638855;4639.559241872017;4651.418572678415;6584.5061620378665;6711.865762684768;6782.321767823228;6788.8302792430095;6799.490038247101;4790.640701947298;4795.017021510582;4801.18379875422;4805.27920811881;4807.975960120177;4811.3745213122775;4820.855374338776;4853.39332583427;4860.684055536379;4869.586085182728;5457.263269458652;5464.153056276284;5472.2338872557875;5518.91721624176;5532.5020748132865;6364.7135878885565;6546.378094081055;6566.606003639797;6571.0471981562405;6573.572717773425;1667.65813008333;1709.8888572242765;1715.5453804741753;1717.1671739206474;1717.4332470284776;1072.110148576695;1143.7026373143042;1151.0848875144281;1162.8197629367462;1173.6185739634652;6322.968385158045;6448.290688024314;6478.902816457757;6485.935140648628;6486.805395838132;6800.299925018745;6811.216710078305;6819.488538359643;6823.147106611674;6834.1457317835275;6451.29035806061;6454.677266136674;6463.192100987377;6464.482841372679;6470.09418681385;3617.0595645132457;3653.8173091345325;3658.689011434005;3660.633936606318;3663.4871118043493;6979.685914133876;7126.394256488256;7170.713171473083;7209.35115839577;7210.67551960163;6951.7219311228;6959.791206263719;6974.825629359205;6974.825629359205;6974.860502790018;7164;7166;7171.784846454615;7195.712171513081;7270.3456688897195;6779.559328643622;6815.522913396015;6832.829179270359;6834.043233947351;6834.2482326943;6485.3514648534765;6718.428933540704;6740.696668650021;6743.561668491532;6746;7103.2186459488385;7128.964355178191;7139.714411423693;7165.283471652793;7174.892376614459;4677.508861569486;4717.198076327101;4719.7404142772475;4722.456917454399;4722.574968252874;6767.627780472121;6791.524593278423;6792.388685018372;6804.829879253059;6812.897806533005;6342.778002769881;6590.736370545124;6599.670016499252;6610.272869984394;6613;6526.477881769542;6568.343165683394;6576.76981305652;6605;6608.966955165193;6424.261209960914;6429.453496452854;6436.485081193587;6436.517261205335;6449.451796597342;6638.767643132467;6639.203295604559;6640.103586015826;6648;6651.467882569286;6289.308176100717;6471.7734879279;6478.125453063776;6522.543421960418;6584.440322572444 06:22:41 INFO - PROCESS | 6270 | |5;yui.html;807.6204184033506;853.5476197615266;890.7149712092131;914.3106474549044;926.6988228825633;15254.923725381372;15450.1502417367;15468.535943921672;15537.300821463034;15552.300146493406;13601.659958501043;13956.092853964485;13996.790048149285;14021.228832414214;14148.50480233192;733.8128777161843;855.3499340501232;855.4610595324937;870.2515836380724;886.9645214191424;887.3522328700053;889.1952782731638;890.6838072484272;892.0900681305064;893.7497500699815;941.0589410589411;943.170010390855;944.504135328951;946.2051876423802;947.1759569174827;784.4508843809356;923.6028507741669;933.9673111441135;936.3024546712675;937.8265020971143;671.509797847574;676.3946268090081;676.9695363708645;683.9692213850388;684.1209046375384;14678;14698;14734.631634209123;14824.777628335583;14826.406943722346;15062.698746025128;15666;15673.764893526606;15768.68462630741;15831.525054248392;12241.143119981516;12477.124280251734;12622;12761.744765104739;12868.420921058481;3991.0820511282277;3997.620226078518;4007.8797636070963;4040.696947728932;4154.459920210384;57369.71315143439;57663.42336576664;57898.131528027116;57901.13148302779;58232.70883645597;11818.94090529559;11954.820677689842;12205.511779528719;12210.511579536897;12340.444679989421;21609.891950540146;21649.458763531038;21658.566828663337;21685.783142168693;21697.13211471555;8584.785380365416;8642.351823613255;8796.648134074565;8904.821903561893;8917.55412229386;4930.433000204951;4957;4988.625853061035;4990.451050384455;5003.3495645565845;3556.715462762973;3557.8932632021083;3608.0979755061235;3608.404613238786;3613;617.7096764520668;619.0683022051783;626.0077776723853;658.4699317049725;659.5218466611764;758.4387553210695;800.4676889868289;803.1005274092936;808.7937575918103;814.2834305810849;9784.951075244579;9816.656417025513;9876.209903207726;9911.207103431709;9917.454540000224;800.3557136505053;812.29736278119;814.6293436486385;828.3869936247133;834.8246868157755;4347.478302603645;4368.825246990148;4527.977360113245;4530.977345113253;4672.995306009157;59883.70058149769;61953.69023154945;62379.6881015592;62718.68640656768;62866.68566657137;55489.722551386985;55571.166432503545;56013.439865601635;56541;56906.7154664224;50284;50304.496955030714;50521.49478505168;51006.74496627493;51505;8679.305655547667;8778.078301778221;8876.911230887608;9059.501727405055;9108.908910911072;36352.45471317985;36685.26629467449;38844.223115536966;39154.80422597869;40129.79935100306;46120;47689;48000;48165.27752083792;48848.75575622099;11784.70538236551;12039.217450865666;12139.271643701406;12277.508899643914;12283.140180187658;13890.652733681738;14008.439662413797;14089.788653170006;14483.20342381137;14485.565433036603;10555.366677999345;13736.244506552235;13798.793018104938;13891.027628065938;14232.146071235758;13486.325683715972;13562.38969246406;13768.86231137716;13786;13869.653258668613;12990;13047.543335983195;13114.540991065267;13333.333333333101;13402.463901443833;11196.440177990906;11233.71915702114;11250.943745281222;11841.348725820162;12019.519219231133;11438.142139339749;11516.19386642927;11611.593594224161;11770.705732356417;11891.524339026342 06:22:41 INFO - PROCESS | 6270 | __end_tp_report 06:22:41 INFO - PROCESS | 6270 | __start_cc_report 06:22:41 INFO - PROCESS | 6270 | _x_x_mozilla_cycle_collect,829 06:22:41 INFO - PROCESS | 6270 | __end_cc_report 06:22:41 INFO - PROCESS | 6270 | __startTimestamp1467379361941__endTimestamp 06:22:41 INFO - PROCESS | 6270 | 06:22:41 INFO - PROCESS | 6270 | ------- Summary: start ------- 06:22:41 INFO - PROCESS | 6270 | Number of tests: 6 06:22:41 INFO - PROCESS | 6270 | 06:22:41 INFO - PROCESS | 6270 | [#0] dojo.html Cycles:165 Average:5547.81 Median:5772.97 stddev:618.21 (10.7%) stddev-sans-first:594.24 06:22:41 INFO - PROCESS | 6270 | Values: 3292.1 3314.7 3322.2 3324.3 3365.6 5546.4 5554.6 5572.2 5588.6 5589.6 5571.7 5595.6 5604.1 5607.5 5653.8 4980.9 4999.1 5048.9 5132.6 5167.8 5027.9 5133.0 5142.8 5161.8 5166.3 5110.9 5144.4 5149.6 5157.9 5162.4 5123.2 5131.7 5158.4 5189.1 5218.5 4881.9 4985.9 5049.1 5061.7 5070.4 5394.5 5403.4 5415.4 5419.7 5442.4 5881.4 5888.5 5889.6 5891.4 5896.1 5871.4 5976.3 6026.8 6032.6 6038.8 5572.7 5586.0 5589.1 5589.4 5589.4 6080.3 6084.6 6087.1 6109.1 6114.2 5773.0 5793.2 5823.3 5860.6 5860.6 5895.6 5931.8 5938.3 5939.7 5985.2 5843.4 5853.5 5956.7 5959.2 5972.6 6017.7 6025.4 6027.7 6031.2 6060.6 4562.1 4583.7 4595.9 4597.5 4618.5 3999.0 4042.6 4066.9 4107.4 4131.2 5637.5 5659.7 5663.5 5663.5 5676.0 5938.2 5942.1 5942.5 5942.6 5948.1 5613.4 5641.7 5723.7 5794.2 5803.5 5028.8 5076.9 5079.4 5080.8 5085.1 6223.7 6228.2 6232.6 6236.7 6236.9 5868.0 5929.1 5990.0 6001.6 6020.2 6182.2 6210.9 6225.5 6233.5 6241.3 5853.1 5870.6 5881.9 5883.3 5917.5 5967.5 5996.3 6014.5 6027.8 6073.0 5804.2 5828.5 5852.3 5860.9 5882.5 5728.8 5872.7 5876.3 5876.7 5878.4 5709.3 5712.9 5724.7 5736.3 5760.7 5874.7 5876.9 5877.3 5883.3 5890.8 5568.2 5702.2 5754.1 5787.1 5798.9 06:22:41 INFO - PROCESS | 6270 | 06:22:41 INFO - PROCESS | 6270 | [#1] ext.html Cycles:180 Average:57086.43 Median:37833.84 stddev:108366.96 (286.4%) stddev-sans-first:108588.00 06:22:41 INFO - PROCESS | 6270 | Values: 610.9 648.8 661.5 662.6 673.5 32449.2 33224.8 33252.2 33316.8 40342.6 43067.4 43567.0 43617.3 43719.3 43776.6 8779.9 8993.3 8994.4 8998.9 9001.0 8346.2 8788.7 10599.6 10880.7 10902.3 10676.9 10700.8 10759.0 10769.4 10769.7 10605.6 10659.8 10702.3 10712.6 10716.2 10410.9 10505.9 10518.9 10532.7 10534.0 44234.6 44685.6 44746.0 44787.1 44844.1 3886.2 4007.5 4014.2 4087.6 4162.8 33701.0 34346.1 34431.5 34443.7 34793.1 4349.6 4586.8 4659.6 4660.9 4667.6 334716.0 336172.0 336740.0 336832.0 336833.0 39441.6 40418.4 40428.4 64841.0 65782.0 37629.8 37722.0 37741.6 37824.2 37843.4 16991.5 17198.7 17200.0 17238.9 17264.7 13526.7 14434.6 14511.5 14521.5 14649.6 9169.1 9186.4 9240.1 9241.2 9248.0 3453.0 3470.9 3508.7 3519.8 3584.8 1117.0 1140.7 1163.1 1235.9 1277.2 32179.8 33084.8 33534.8 33865.0 33869.7 1222.5 1241.2 1251.2 1276.6 1333.9 17655.8 17899.6 18008.1 18030.4 18241.0 514142.0 521475.0 521537.0 521566.0 522483.0 63079.7 63142.4 63197.4 63797.4 63842.7 1460.0 1502.9 1505.9 1555.4 1620.2 30642.5 31173.7 31603.4 32065.0 32286.0 46850.0 61994.4 63726.4 63763.7 63858.7 342320.0 345268.0 346952.0 347938.0 348606.0 39749.8 42508.4 47932.5 49890.0 50182.2 48990.0 49304.5 49357.0 49830.5 49885.8 39113.4 40046.0 40170.6 41084.8 41502.6 38475.2 39697.0 39703.8 40201.0 40515.2 45808.5 46633.0 46787.0 47167.8 47445.1 38545.6 39656.8 39700.8 40211.2 40289.0 30402.2 30708.4 30732.9 30915.0 31159.5 06:22:41 INFO - PROCESS | 6270 | 06:22:41 INFO - PROCESS | 6270 | [#2] jquery.html Cycles:180 Average:29237.72 Median:2116.66 stddev:81418.31 (3846.6%) stddev-sans-first:81617.96 06:22:41 INFO - PROCESS | 6270 | Values: 422.5 424.7 434.4 437.3 445.7 18767.0 18968.8 19254.9 19440.8 19470.8 18942.5 19068.1 19995.8 20078.4 20080.2 5661.7 5663.6 5957.2 5961.1 5970.5 4330.8 5865.5 5923.7 6172.9 6472.9 6432.8 6446.7 6453.1 6459.6 6471.2 5632.4 5829.2 5896.3 5902.4 6419.1 4060.9 5629.3 5691.9 5721.0 5895.9 14172.2 14245.6 14341.6 14457.1 14458.8 2453.9 2520.4 2555.3 2583.7 2650.3 13793.2 14531.8 14548.1 15109.3 15665.8 2014.1 2045.4 2110.7 2122.7 2198.8 78856.0 79351.6 81409.6 81949.6 82401.0 11158.4 11485.5 11624.8 11684.4 11729.5 16210.7 16335.6 16362.7 16372.8 16430.6 8956.4 9048.0 9103.9 9148.9 9212.4 8869.2 8886.2 8925.6 9030.1 9077.8 4956.1 4965.9 4981.2 5065.9 5112.1 1845.0 1928.3 2018.6 2027.7 2041.8 992.2 1053.1 1062.2 1133.6 1137.5 19512.5 19535.9 19672.2 19771.3 19907.2 1027.1 1066.6 1076.4 1123.5 1153.8 10882.9 11095.4 11137.8 11194.9 11246.5 483332.0 493632.0 495353.0 496078.0 502189.0 89591.0 91226.5 91859.5 93653.5 93672.5 1107.1 1125.4 1133.8 1138.7 1142.5 17086.2 17599.0 17602.5 17607.0 17963.4 38981.6 39353.8 40274.6 40788.4 41019.6 59231.0 59651.4 60076.4 60726.4 61335.4 8705.2 8984.4 8984.9 9150.6 9232.1 9694.9 13177.1 13233.6 13530.6 13617.8 11823.6 11873.6 11891.8 11900.8 11958.8 11432.8 11433.5 11897.9 11934.2 12162.1 11770.4 11788.6 12020.6 12223.3 12517.7 8785.2 8913.6 8933.9 9073.0 9096.4 11920.2 12018.5 12111.3 12144.9 12241.8 06:22:41 INFO - PROCESS | 6270 | 06:22:41 INFO - PROCESS | 6270 | [#3] mootools.html Cycles:180 Average:5765.95 Median:4758.34 stddev:3152.65 (66.3%) stddev-sans-first:3144.44 06:22:41 INFO - PROCESS | 6270 | Values: 1403.3 1561.4 1564.2 1771.6 1880.8 8314.5 8527.9 8562.1 8562.1 8571.0 8233.6 8425.4 8426.5 8428.0 8438.7 2420.3 2451.9 2454.2 2454.5 2454.7 2426.0 2507.8 2521.2 2523.1 2534.4 2436.5 2454.3 2461.1 2461.1 2471.9 2414.5 2428.9 2445.8 2473.9 2475.0 2470.9 2492.9 2512.2 2513.3 2529.9 8330.2 8513.2 8547.1 8556.4 8567.0 5305.6 5419.8 5432.6 5433.0 5437.5 3428.5 3467.6 3473.0 3505.1 3518.2 1185.9 1186.6 1202.6 1222.8 1244.9 11758.3 12123.8 12165.8 12171.3 12201.4 4309.0 4414.7 4544.9 4606.9 4610.5 9745.0 9802.3 9818.8 9828.4 9835.1 5155.1 5186.2 5195.8 5198.3 5201.8 4343.8 4369.0 4464.4 4666.3 4850.4 3877.7 3912.9 3980.2 4032.8 4045.5 1211.2 1211.4 1215.7 1222.3 1229.5 1079.6 1083.5 1092.4 1112.7 1123.3 6097.2 6116.5 6238.8 6257.7 6258.3 1025.2 1025.5 1036.9 1050.9 1056.6 4265.7 4333.8 4335.6 4340.7 4344.0 10246.8 10481.4 10645.8 10669.2 10697.9 10539.4 10570.9 10842.2 10858.5 10886.2 7912.2 8045.5 8068.2 8165.2 8176.3 5867.9 6155.6 6184.9 6203.4 6271.5 9614.4 9689.2 9778.4 9893.7 9900.5 9794.0 9855.2 9914.3 10291.5 10300.2 7511.7 7600.6 7707.5 7832.1 7837.1 8312.8 8325.5 8332.9 8367.8 8388.4 7493.1 7532.4 7555.9 7695.8 7826.5 7448.4 7527.0 7559.4 7574.5 7648.7 6914.1 6921.3 6933.1 6972.2 6988.2 5088.2 5157.9 5243.2 5284.4 5291.1 5368.4 5415.4 5482.5 5495.6 5497.3 06:22:41 INFO - PROCESS | 6270 | 06:22:41 INFO - PROCESS | 6270 | [#4] prototype.html Cycles:180 Average:5515.44 Median:6306.14 stddev:1664.32 (26.4%) stddev-sans-first:1623.20 06:22:41 INFO - PROCESS | 6270 | Values: 349.6 350.6 356.1 358.3 361.2 6098.5 6101.7 6103.8 6133.7 6161.7 6107.0 6141.3 6152.7 6208.7 6217.6 4491.4 4596.5 4722.5 4741.1 4741.1 4705.5 4705.6 4727.5 4737.3 4758.6 4505.7 4663.3 4663.3 4680.8 4688.2 4494.6 4622.2 4631.8 4651.9 4678.0 4083.2 4096.3 4100.3 4103.3 4107.2 5885.4 5905.9 5906.0 5911.0 5917.5 5429.2 5440.7 5441.4 5447.5 5451.8 6459.4 6462.0 6464.8 6484.9 6489.7 4515.0 4633.7 4639.0 4639.6 4651.4 6584.5 6711.9 6782.3 6788.8 6799.5 4790.6 4795.0 4801.2 4805.3 4808.0 4811.4 4820.9 4853.4 4860.7 4869.6 5457.3 5464.2 5472.2 5518.9 5532.5 6364.7 6546.4 6566.6 6571.0 6573.6 1667.7 1709.9 1715.5 1717.2 1717.4 1072.1 1143.7 1151.1 1162.8 1173.6 6323.0 6448.3 6478.9 6485.9 6486.8 6800.3 6811.2 6819.5 6823.1 6834.1 6451.3 6454.7 6463.2 6464.5 6470.1 3617.1 3653.8 3658.7 3660.6 3663.5 6979.7 7126.4 7170.7 7209.4 7210.7 6951.7 6959.8 6974.8 6974.8 6974.9 7164.0 7166.0 7171.8 7195.7 7270.3 6779.6 6815.5 6832.8 6834.0 6834.2 6485.4 6718.4 6740.7 6743.6 6746.0 7103.2 7129.0 7139.7 7165.3 7174.9 4677.5 4717.2 4719.7 4722.5 4722.6 6767.6 6791.5 6792.4 6804.8 6812.9 6342.8 6590.7 6599.7 6610.3 6613.0 6526.5 6568.3 6576.8 6605.0 6609.0 6424.3 6429.5 6436.5 6436.5 6449.5 6638.8 6639.2 6640.1 6648.0 6651.5 6289.3 6471.8 6478.1 6522.5 6584.4 06:22:41 INFO - PROCESS | 6270 | 06:22:41 INFO - PROCESS | 6270 | [#5] yui.html Cycles:180 Average:15563.47 Median:26181.00 stddev:17598.30 (67.2%) stddev-sans-first:17612.78 06:22:41 INFO - PROCESS | 6270 | Values: 807.6 853.5 890.7 914.3 926.7 15254.9 15450.2 15468.5 15537.3 15552.3 13601.7 13956.1 13996.8 14021.2 14148.5 733.8 855.3 855.5 870.3 887.0 887.4 889.2 890.7 892.1 893.7 941.1 943.2 944.5 946.2 947.2 784.5 923.6 934.0 936.3 937.8 671.5 676.4 677.0 684.0 684.1 14678.0 14698.0 14734.6 14824.8 14826.4 15062.7 15666.0 15673.8 15768.7 15831.5 12241.1 12477.1 12622.0 12761.7 12868.4 3991.1 3997.6 4007.9 4040.7 4154.5 57369.7 57663.4 57898.1 57901.1 58232.7 11818.9 11954.8 12205.5 12210.5 12340.4 21609.9 21649.5 21658.6 21685.8 21697.1 8584.8 8642.4 8796.6 8904.8 8917.6 4930.4 4957.0 4988.6 4990.5 5003.3 3556.7 3557.9 3608.1 3608.4 3613.0 617.7 619.1 626.0 658.5 659.5 758.4 800.5 803.1 808.8 814.3 9785.0 9816.7 9876.2 9911.2 9917.5 800.4 812.3 814.6 828.4 834.8 4347.5 4368.8 4528.0 4531.0 4673.0 59883.7 61953.7 62379.7 62718.7 62866.7 55489.7 55571.2 56013.4 56541.0 56906.7 50284.0 50304.5 50521.5 51006.7 51505.0 8679.3 8778.1 8876.9 9059.5 9108.9 36352.5 36685.3 38844.2 39154.8 40129.8 46120.0 47689.0 48000.0 48165.3 48848.8 11784.7 12039.2 12139.3 12277.5 12283.1 13890.7 14008.4 14089.8 14483.2 14485.6 10555.4 13736.2 13798.8 13891.0 14232.1 13486.3 13562.4 13768.9 13786.0 13869.7 12990.0 13047.5 13114.5 13333.3 13402.5 11196.4 11233.7 11250.9 11841.3 12019.5 11438.1 11516.2 11611.6 11770.7 11891.5 06:22:41 INFO - PROCESS | 6270 | -------- Summary: end -------- 06:22:41 INFO - PROCESS | 6270 | 06:22:42 INFO - TEST-INFO | 6270: exit 0 06:22:42 INFO - TEST-OK | dromaeo_css | took 1112271ms 06:22:42 INFO - TEST-START | kraken 06:22:42 INFO - operating with platform_type : linux_ 06:22:42 INFO - Initialising browser for kraken test... 06:22:42 INFO - TEST-INFO | started process 6467 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkKfaw7/profile http://localhost:58907/getInfo.html) 06:22:47 INFO - PROCESS | 6467 | __metrics Screen width/height:1600/1200 06:22:47 INFO - PROCESS | 6467 | colorDepth:24 06:22:47 INFO - PROCESS | 6467 | Browser inner width/height: 1024/697 06:22:47 INFO - PROCESS | 6467 | __metrics 06:22:48 ERROR - PROCESS | 6467 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 06:22:49 INFO - TEST-INFO | 6467: exit 0 06:22:49 INFO - Browser initialized. 06:22:49 INFO - Running cycle 1/1 for kraken test... 06:22:49 INFO - TEST-INFO | started process 6561 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkKfaw7/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:23:01 INFO - PROCESS | 6561 | RSS: Main: 139583488 06:23:01 INFO - PROCESS | 6561 | 06:23:03 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:58907/tests/kraken/driver.html?testName=audio-beat-detection) 06:23:04 INFO - PROCESS | 6561 | RSS: Main: 197836800 06:23:04 INFO - PROCESS | 6561 | 06:23:06 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:58907/tests/kraken/driver.html?testName=audio-dft) 06:23:07 INFO - PROCESS | 6561 | RSS: Main: 185016320 06:23:07 INFO - PROCESS | 6561 | 06:23:10 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:58907/tests/kraken/driver.html?testName=audio-fft) 06:23:10 INFO - PROCESS | 6561 | RSS: Main: 274890752 06:23:10 INFO - PROCESS | 6561 | 06:23:12 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:58907/tests/kraken/driver.html?testName=audio-oscillator) 06:23:13 INFO - PROCESS | 6561 | RSS: Main: 180850688 06:23:13 INFO - PROCESS | 6561 | 06:23:15 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:58907/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:23:16 INFO - PROCESS | 6561 | RSS: Main: 179220480 06:23:16 INFO - PROCESS | 6561 | 06:23:19 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:58907/tests/kraken/driver.html?testName=imaging-darkroom) 06:23:19 INFO - PROCESS | 6561 | RSS: Main: 213868544 06:23:19 INFO - PROCESS | 6561 | 06:23:23 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:58907/tests/kraken/driver.html?testName=imaging-desaturate) 06:23:23 INFO - PROCESS | 6561 | RSS: Main: 213278720 06:23:23 INFO - PROCESS | 6561 | 06:23:26 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:58907/tests/kraken/driver.html?testName=json-parse-financial) 06:23:27 INFO - PROCESS | 6561 | RSS: Main: 213364736 06:23:27 INFO - PROCESS | 6561 | 06:23:28 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:58907/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:23:29 INFO - PROCESS | 6561 | RSS: Main: 192974848 06:23:29 INFO - PROCESS | 6561 | 06:23:30 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:58907/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:23:31 INFO - PROCESS | 6561 | RSS: Main: 196743168 06:23:31 INFO - PROCESS | 6561 | 06:23:33 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:58907/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:23:34 INFO - PROCESS | 6561 | RSS: Main: 209399808 06:23:34 INFO - PROCESS | 6561 | 06:23:36 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:58907/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:23:37 INFO - PROCESS | 6561 | RSS: Main: 216006656 06:23:37 INFO - PROCESS | 6561 | 06:23:39 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:58907/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:23:40 INFO - PROCESS | 6561 | RSS: Main: 212312064 06:23:40 INFO - PROCESS | 6561 | 06:23:41 INFO - PROCESS | 6561 | Cycle 1(1): loaded http://localhost:58907/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:58907/tests/kraken/driver.html?testName=ai-astar) 06:23:42 INFO - PROCESS | 6561 | RSS: Main: 273637376 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | __start_tp_report 06:23:42 INFO - PROCESS | 6561 | _x_x_mozilla_page_load 06:23:42 INFO - PROCESS | 6561 | _x_x_mozilla_page_load_details 06:23:42 INFO - PROCESS | 6561 | |i|pagename|runs| 06:23:42 INFO - PROCESS | 6561 | |0;ai-astar;110;112;109;112;110;110;107;109;108;108 06:23:42 INFO - PROCESS | 6561 | |1;audio-beat-detection;152;126;151;178;132;152;154;134;181;133 06:23:42 INFO - PROCESS | 6561 | |2;audio-dft;162;159;158;160;161;161;161;162;161;161 06:23:42 INFO - PROCESS | 6561 | |3;audio-fft;74;76;76;175;74;74;75;73;157;75 06:23:42 INFO - PROCESS | 6561 | |4;audio-oscillator;92;92;153;92;92;93;155;92;92;145 06:23:42 INFO - PROCESS | 6561 | |5;imaging-gaussian-blur;116;117;117;117;117;116;117;117;117;117 06:23:42 INFO - PROCESS | 6561 | |6;imaging-darkroom;145;145;146;145;146;145;146;146;145;145 06:23:42 INFO - PROCESS | 6561 | |7;imaging-desaturate;95;95;95;95;95;94;94;94;94;94 06:23:42 INFO - PROCESS | 6561 | |8;json-parse-financial;59;55;55;56;56;59;57;76;53;52 06:23:42 INFO - PROCESS | 6561 | |9;json-stringify-tinderbox;58;59;59;58;58;57;57;58;57;58 06:23:42 INFO - PROCESS | 6561 | |10;stanford-crypto-aes;72;80;72;77;74;74;74;73;73;77 06:23:42 INFO - PROCESS | 6561 | |11;stanford-crypto-ccm;120;117;115;115;109;113;113;113;131;114 06:23:42 INFO - PROCESS | 6561 | |12;stanford-crypto-pbkdf2;159;157;160;161;159;159;160;164;159;160 06:23:42 INFO - PROCESS | 6561 | |13;stanford-crypto-sha256-iterative;68;65;66;67;65;67;66;66;65;67 06:23:42 INFO - PROCESS | 6561 | __end_tp_report 06:23:42 INFO - PROCESS | 6561 | __start_cc_report 06:23:42 INFO - PROCESS | 6561 | _x_x_mozilla_cycle_collect,1553 06:23:42 INFO - PROCESS | 6561 | __end_cc_report 06:23:42 INFO - PROCESS | 6561 | __startTimestamp1467379422221__endTimestamp 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | ------- Summary: start ------- 06:23:42 INFO - PROCESS | 6561 | Number of tests: 14 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#0] ai-astar Cycles:10 Average:109.50 Median:110.00 stddev:1.65 (1.5%) stddev-sans-first:1.74 06:23:42 INFO - PROCESS | 6561 | Values: 110.0 112.0 109.0 112.0 110.0 110.0 107.0 109.0 108.0 108.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#1] audio-beat-detection Cycles:10 Average:149.30 Median:152.00 stddev:18.89 (12.4%) stddev-sans-first:20.01 06:23:42 INFO - PROCESS | 6561 | Values: 152.0 126.0 151.0 178.0 132.0 152.0 154.0 134.0 181.0 133.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#2] audio-dft Cycles:10 Average:160.60 Median:161.00 stddev:1.26 (0.8%) stddev-sans-first:1.24 06:23:42 INFO - PROCESS | 6561 | Values: 162.0 159.0 158.0 160.0 161.0 161.0 161.0 162.0 161.0 161.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#3] audio-fft Cycles:10 Average:92.90 Median:74.50 stddev:38.77 (52.0%) stddev-sans-first:40.52 06:23:42 INFO - PROCESS | 6561 | Values: 74.0 76.0 76.0 175.0 74.0 74.0 75.0 73.0 157.0 75.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#4] audio-oscillator Cycles:10 Average:109.80 Median:92.00 stddev:28.54 (31.0%) stddev-sans-first:29.54 06:23:42 INFO - PROCESS | 6561 | Values: 92.0 92.0 153.0 92.0 92.0 93.0 155.0 92.0 92.0 145.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#5] imaging-gaussian-blur Cycles:10 Average:116.80 Median:117.00 stddev:0.42 (0.4%) stddev-sans-first:0.33 06:23:42 INFO - PROCESS | 6561 | Values: 116.0 117.0 117.0 117.0 117.0 116.0 117.0 117.0 117.0 117.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#6] imaging-darkroom Cycles:10 Average:145.40 Median:145.50 stddev:0.52 (0.4%) stddev-sans-first:0.53 06:23:42 INFO - PROCESS | 6561 | Values: 145.0 145.0 146.0 145.0 146.0 145.0 146.0 146.0 145.0 145.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#7] imaging-desaturate Cycles:10 Average:94.50 Median:95.00 stddev:0.53 (0.6%) stddev-sans-first:0.53 06:23:42 INFO - PROCESS | 6561 | Values: 95.0 95.0 95.0 95.0 95.0 94.0 94.0 94.0 94.0 94.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#8] json-parse-financial Cycles:10 Average:57.80 Median:56.50 stddev:6.78 (12.0%) stddev-sans-first:7.18 06:23:42 INFO - PROCESS | 6561 | Values: 59.0 55.0 55.0 56.0 56.0 59.0 57.0 76.0 53.0 52.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#9] json-stringify-tinderbox Cycles:10 Average:57.90 Median:58.00 stddev:0.74 (1.3%) stddev-sans-first:0.78 06:23:42 INFO - PROCESS | 6561 | Values: 58.0 59.0 59.0 58.0 58.0 57.0 57.0 58.0 57.0 58.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#10] stanford-crypto-aes Cycles:10 Average:74.60 Median:74.00 stddev:2.59 (3.5%) stddev-sans-first:2.57 06:23:42 INFO - PROCESS | 6561 | Values: 72.0 80.0 72.0 77.0 74.0 74.0 74.0 73.0 73.0 77.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#11] stanford-crypto-ccm Cycles:10 Average:116.00 Median:115.00 stddev:6.00 (5.2%) stddev-sans-first:6.19 06:23:42 INFO - PROCESS | 6561 | Values: 120.0 117.0 115.0 115.0 109.0 113.0 113.0 113.0 131.0 114.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:159.80 Median:160.00 stddev:1.81 (1.1%) stddev-sans-first:1.90 06:23:42 INFO - PROCESS | 6561 | Values: 159.0 157.0 160.0 161.0 159.0 159.0 160.0 164.0 159.0 160.0 06:23:42 INFO - PROCESS | 6561 | 06:23:42 INFO - PROCESS | 6561 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.20 Median:66.50 stddev:1.03 (1.6%) stddev-sans-first:0.87 06:23:42 INFO - PROCESS | 6561 | Values: 68.0 65.0 66.0 67.0 65.0 67.0 66.0 66.0 65.0 67.0 06:23:42 INFO - PROCESS | 6561 | -------- Summary: end -------- 06:23:42 INFO - PROCESS | 6561 | 06:23:43 INFO - TEST-INFO | 6561: exit 0 06:23:43 INFO - TEST-OK | kraken | took 60516ms 06:23:43 INFO - SUITE-END | took 1172s 06:23:43 INFO - Completed test suite (00:19:32) 06:23:43 INFO - javascript benchmark 06:23:43 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3292.1440425489373, 3314.701676849085, 3322.2192784695594, 3324.318514704486, 3365.5961284645846, 5546.445355464457, 5554.555635549156, 5572.192032155335, 5588.608797384175, 5589.580781441393, 5571.665700057999, 5595.552355811536, 5604.075327570956, 5607.495325420711, 5653.802116925908, 4980.900381992376, 4999.0501804657, 5048.9495105048845, 5132.563732082777, 5167.819126330579, 5027.899442011158, 5132.97433512832, 5142.768575414116, 5161.76772045257, 5166.302549155854, 5110.897782044357, 5144.4083930348115, 5149.613778966574, 5157.871053223681, 5162.380514338266, 5123.180291153416, 5131.7434128293435, 5158.3552055993005, 5189.117849965515, 5218.504242096995, 4881.8535443936735, 4985.925211121836, 5049.116404629175, 5061.696298222082, 5070.3915530136255, 5394.541463975527, 5403.378611459693, 5415.404305526389, 5419.674819510842, 5442.428545002796, 5881.441263080001, 5888.499477544414, 5889.558283128739, 5891.410858914117, 5896.056630939029, 5871.412858714094, 5976.252968378953, 6026.758929642809, 6032.577719559633, 6038.758449662008, 5572.693501857396, 5586.022446071921, 5589.105743081128, 5589.357223919261, 5589.413111623302, 6080.3106873460165, 6084.574079814459, 6087.086936959491, 6109.114178444101, 6114.205153330038, 5772.9711351442975, 5793.188953546507, 5823.301203855564, 5860.560457965669, 5860.648361098348, 5895.587308888336, 5931.7923872665115, 5938.346781853993, 5939.70301484924, 5985.191999080069, 5843.415658434207, 5853.5317174625925, 5956.7319470623925, 5959.1657167995645, 5972.611780234271, 6017.729202185912, 6025.397460253939, 6027.698615069229, 6031.185789918305, 6060.636361818217, 4562.110388474216, 4583.702059366131, 4595.885102872455, 4597.494275629678, 4618.538146185355, 3999.0402303446963, 4042.5957404259925, 4066.898327541835, 4107.424960505532, 4131.153113611703, 5637.548996080303, 5659.660420374708, 5663.46197111282, 5663.546916246691, 5675.971620141873, 5938.168656388109, 5942.138389933435, 5942.494887934487, 5942.58401911862, 5948.137520059568, 5613.410591887793, 5641.661500309912, 5723.685197314105, 5794.159846822187, 5803.506701930383, 5028.773705183203, 5076.873078173001, 5079.390473143247, 5080.77136528857, 5085.1355269604255, 6223.657698826518, 6228.159198508234, 6232.626042437469, 6236.719347629368, 6236.906446403307, 5867.970660146757, 5929.080992446177, 5990.0, 6001.639901605918, 6020.157177994996, 6182.165407669907, 6210.906836397367, 6225.470834979077, 6233.470155036873, 6241.282252540835, 5853.1220316952795, 5870.559708022, 5881.882362352643, 5883.294004719461, 5917.467427931507, 5967.46292833647, 5996.340402555803, 6014.548908831767, 6027.78902738402, 6073.0283154695035, 5804.245448091721, 5828.475437210672, 5852.326982397079, 5860.912086318794, 5882.470577648032, 5728.770849166153, 5872.677002764718, 5876.324222714443, 5876.735546900314, 5878.441548052928, 5709.314882214161, 5712.942870571241, 5724.74238659253, 5736.282964629421, 5760.740766665426, 5874.706264686834, 5876.882462350643, 5877.294724633071, 5883.323417806836, 5890.823275301748, 5568.16477528374, 5702.173184888251, 5754.05058165398, 5787.074068149076, 5798.884022319446], "value": 5507.261389989891, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [610.8869859076071, 648.8280605639507, 661.5336187987466, 662.5825729790231, 673.501608809481, 32449.188770280725, 33224.83387583062, 33252.16869578256, 33316.833415832945, 40342.59657403432, 43067.35398969018, 43567.0, 43617.34573981385, 43719.344209836876, 43776.56223437765, 8779.912200877989, 8993.325500587449, 8994.415363001417, 8998.910010899905, 9000.954995225014, 8346.207110324509, 8788.692395766118, 10599.629012984547, 10880.727981800479, 10902.291351062195, 10676.946615266912, 10700.78598428031, 10759.031687148155, 10769.407682577455, 10769.676909692722, 10605.575776968912, 10659.78680426395, 10702.304350217211, 10712.625058122929, 10716.249862509667, 10410.895891041144, 10505.894941050568, 10518.894811051869, 10532.736681582945, 10534.0, 44234.55765442336, 44685.55314446879, 44746.0, 44787.10425791499, 44844.103117937455, 3886.164474637938, 4007.519097708294, 4014.1770936957855, 4087.6116768906904, 4162.7502349859105, 33701.0, 34346.14134646629, 34431.48352774711, 34443.65556344455, 34793.13017174566, 4349.586789255016, 4586.816527338902, 4659.603933665642, 4660.906781864378, 4667.6265898728025, 334716.0, 336172.0, 336740.0, 336831.99999999756, 336833.0, 39441.60558394379, 40418.39372409416, 40428.393574096415, 64841.0, 65782.0, 37629.81185094057, 37722.0, 37741.62258377436, 37824.243515130096, 37843.4323485148, 16991.49025529236, 17198.656026879642, 17200.0, 17238.913805430893, 17264.74102888458, 13526.661833454045, 14434.566962991126, 14511.492097776527, 14521.491747788778, 14649.560513184622, 9169.08309169091, 9186.448813071238, 9240.07599240084, 9241.21449676785, 9248.0, 3452.9654703452643, 3470.9479357809655, 3508.736844736655, 3519.771214871025, 3584.766990145632, 1116.977965161884, 1140.663504266227, 1163.1160318158093, 1235.857876344214, 1277.1698396042461, 32179.839100804813, 33084.834575826964, 33534.8323258387, 33865.0, 33869.66130338714, 1222.535436534129, 1241.205628397826, 1251.2367455851922, 1276.6106337566946, 1333.8666133386585, 17655.823441765675, 17899.642007159782, 18008.09959502046, 18030.412383962674, 18241.0, 514142.0, 521475.0, 521537.0, 521566.0, 522483.0, 63079.6846015767, 63142.36857631457, 63197.420064497834, 63797.36202638007, 63842.68078659577, 1460.0, 1502.947396841127, 1505.9247037648074, 1555.416718730476, 1620.181808186858, 30642.540361895037, 31173.688263117077, 31603.36793264168, 32065.0, 32286.0, 46850.0, 61994.38005619886, 63726.362736372044, 63763.6811815938, 63858.68070659617, 342320.0, 345268.0, 346952.0, 347938.0, 348606.0, 39749.80125099356, 42508.36237456379, 47932.5206747928, 49890.0, 50182.247266291764, 48990.0, 49304.506954929995, 49357.0, 49830.501694984036, 49885.750571246914, 39113.41329879997, 40046.0, 40170.59829401669, 41084.79457602693, 41502.584974149875, 38475.230495389376, 39697.0, 39703.80148099241, 40201.0, 40515.1896962065, 45808.541914580426, 46633.0, 46787.0, 47167.76416118035, 47445.05109897852, 38545.61454385532, 39656.801715991234, 39700.80149599234, 40211.195776084896, 40289.0, 30402.239944000692, 30708.385832282784, 30732.907721412885, 30915.0, 31159.53260701046], "value": 20172.373610661518, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [422.4782393743728, 424.7366632687734, 434.3788382612864, 437.3221506664671, 445.6523911349147, 18767.0, 18968.810311896876, 19254.903725481352, 19440.80559194411, 19470.805291947094, 18942.526436839053, 19068.141933612987, 19995.800041999577, 20078.397648070582, 20080.196792128332, 5661.688607126616, 5663.555793272731, 5957.195778569902, 5961.135635332874, 5970.462658360747, 4330.84842030529, 5865.501432378253, 5923.703814809264, 6172.938270617304, 6472.9029064564065, 6432.77485288015, 6446.677666116699, 6453.128827608283, 6459.6447195404235, 6471.223453185625, 5632.35227948785, 5829.154772557998, 5896.292444906617, 5902.380250073767, 6419.101325814389, 4060.8781736547658, 5629.324481062258, 5691.946989806899, 5720.971395143039, 5895.852603684899, 14172.220527870963, 14245.64385890361, 14341.56975290743, 14457.132572045606, 14458.783118253235, 2453.914113006054, 2520.3699075231193, 2555.3228394475477, 2583.702874169457, 2650.271175426754, 13793.172409655352, 14531.78202326966, 14548.127112373186, 15109.320080596399, 15665.765013524806, 2014.0835919656522, 2045.3557129504159, 2110.6517424624917, 2122.6603743400983, 2198.8021078103047, 78856.0, 79351.60324198342, 81409.59295203545, 81949.59025204895, 82401.0, 11158.437818705388, 11485.483153258123, 11624.825627615592, 11684.415779211005, 11729.472173752201, 16210.67578648444, 16335.591610209602, 16362.672746545002, 16372.754408683879, 16430.589235268973, 8956.417832840974, 9047.954760226157, 9103.90896091044, 9148.908510914938, 9212.447253164832, 8869.157430044135, 8886.24466920306, 8925.553722313858, 9030.051844556358, 9077.77305567366, 4956.10790057793, 4965.875853103701, 4981.203007518852, 5065.898682026339, 5112.054269960069, 1844.981550184481, 1928.2576208159678, 2018.5861898310811, 2027.7363942687357, 2041.8162365387186, 992.2161492421051, 1053.1101219469535, 1062.2458054781036, 1133.586241022021, 1137.4767606900753, 19512.512187195432, 19535.902320488305, 19672.21311147538, 19771.30800422007, 19907.203711851653, 1027.106417416852, 1066.626680661762, 1076.445630500293, 1123.5000424811044, 1153.7519433321877, 10882.945585272022, 11095.389753563632, 11137.777244455065, 11194.888051119384, 11246.49390777417, 483332.0, 493632.0, 495353.0, 496078.0, 502189.0, 89591.0, 91226.54386728157, 91859.54070229606, 93653.53173234226, 93672.53163734273, 1107.092184408777, 1125.4091601909063, 1133.8242572401125, 1138.7494751154898, 1142.5486932661552, 17086.18003116379, 17599.0, 17602.471925842245, 17607.0, 17963.371282005068, 38981.6101838978, 39353.80323098366, 40274.59725402708, 40788.388174178006, 41019.589804101575, 59231.0, 59651.40348596458, 60076.39923600883, 60726.39273607384, 61335.38664613297, 8705.216530512283, 8984.375000000115, 8984.910150898408, 9150.633974641207, 9232.076792320715, 9694.85457718149, 13177.143485673401, 13233.602991910258, 13530.594082177551, 13617.79573306421, 11823.645290641294, 11873.584424545099, 11891.82162267584, 11900.821487677866, 11958.760824783629, 11432.828507572227, 11433.485493152995, 11897.881021190024, 11934.22427542207, 12162.087843411957, 11770.419338533342, 11788.587399440978, 12020.63938081859, 12223.327716975651, 12517.687057823627, 8785.165409286108, 8913.55432228399, 8933.865992010255, 9072.95463522678, 9096.408733432305, 11920.165588409074, 12018.519259229533, 12111.333876636869, 12144.878551214375, 12241.755164896831], "value": 9540.705162908302, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1403.2913378743733, 1561.39105748758, 1564.2178910544728, 1771.627958128793, 1880.8119188081193, 8314.501129932201, 8527.91472085279, 8562.100979397159, 8562.143785621434, 8570.957145214274, 8233.588320583976, 8425.36809739269, 8426.536540490286, 8428.0, 8438.704645337415, 2420.322309753263, 2451.8528888266674, 2454.16558370155, 2454.521368333176, 2454.6931633545805, 2425.9696927568457, 2507.7743003129713, 2521.205820166642, 2523.116909081825, 2534.3790771261065, 2436.488337449138, 2454.312792418126, 2461.113998960373, 2461.126300163443, 2471.851688898672, 2414.5170965806733, 2428.9271321860374, 2445.76765207305, 2473.8763061846835, 2475.0223661653545, 2470.8641024743633, 2492.9002839886384, 2512.170983575416, 2513.2711513661015, 2529.924102276916, 8330.166983301682, 8513.233808957224, 8547.102554231778, 8556.358273129541, 8567.0, 5305.575553955674, 5419.756110974976, 5432.565394768409, 5433.0, 5437.510624043855, 3428.5371474850826, 3467.6185619581825, 3472.965270347315, 3505.071156143624, 3518.2084031093054, 1185.851768528934, 1186.6084192216547, 1202.615163147793, 1222.8288039674364, 1244.8941839943616, 11758.294502329802, 12123.818142727954, 12165.756684866341, 12171.2697238166, 12201.389930503528, 4309.0, 4414.726415895816, 4544.909101817945, 4606.861794146181, 4610.538946105363, 9745.0, 9802.313838031412, 9818.754531136636, 9828.4102953823, 9835.114839664464, 5155.072087024371, 5186.170212765939, 5195.792168313225, 5198.2722418861385, 5201.765920533585, 4343.82624695015, 4368.956310436855, 4464.352668862996, 4666.253399456071, 4850.417949846041, 3877.65101140893, 3912.8630497932436, 3980.1840622672285, 4032.7580345179385, 4045.5347635021762, 1211.1824518450012, 1211.4487908001838, 1215.7386161975041, 1222.2971791220084, 1229.4959066782756, 1079.5843600213818, 1083.534080345459, 1092.4264761000538, 1112.6550769261555, 1123.2586492914636, 6097.237845269341, 6116.480099191618, 6238.75044998195, 6257.7184026718905, 6258.311585725566, 1025.190099821133, 1025.477006726575, 1036.8859425463193, 1050.9001644843727, 1056.5773690523852, 4265.680073994463, 4333.7833108345085, 4335.588119128678, 4340.717853339523, 4344.0, 10246.846297305547, 10481.371117732808, 10645.78708425827, 10669.19981001428, 10697.893021069689, 10539.42033188182, 10570.947145264377, 10842.186835987333, 10858.511366988505, 10886.183536234814, 7912.248336408032, 8045.517268963764, 8068.233517815798, 8165.183481651906, 8176.3458923286, 5867.882642347044, 6155.630082418212, 6184.8763024738355, 6203.4416902479, 6271.529635277464, 9614.423134611945, 9689.224862011164, 9778.41329520231, 9893.703188904345, 9900.504974751379, 9793.951030244803, 9855.162311203629, 9914.30599858003, 10291.53688084023, 10300.175985920958, 7511.699532018658, 7600.619969001638, 7707.499012564165, 7832.138464768985, 7837.098733645704, 8312.83374332522, 8325.500469971821, 8332.916670833214, 8367.832643347221, 8388.412811103408, 7493.138289096823, 7532.359749421142, 7555.9244407555225, 7695.769126926201, 7826.530408175528, 7448.366888814295, 7526.962365188139, 7559.395248380227, 7574.545527268381, 7648.694052237848, 6914.135733033371, 6921.2732663069655, 6933.1333583302085, 6972.233054363915, 6988.161420629557, 5088.236764485357, 5157.871053223699, 5243.161094225058, 5284.41871394154, 5291.100512912891, 5368.3557973041925, 5415.4313797050745, 5482.506574408322, 5495.5878309127775, 5497.340319161726], "value": 4698.740417724418, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [349.6486031538302, 350.5775540473729, 356.1061735045038, 358.34244161962795, 361.15309598990376, 6098.4511393974535, 6101.664408457538, 6103.816885493442, 6133.723982420791, 6161.661108639023, 6106.992346262872, 6141.293751218611, 6152.707931334425, 6208.720607572659, 6217.5958562693395, 4491.393661855648, 4596.471405788327, 4722.50413706561, 4741.075490279397, 4741.075490279397, 4705.458872229703, 4705.55297246761, 4727.456342520602, 4737.265723812815, 4758.643101767364, 4505.707129036618, 4663.2538793793, 4663.347131401607, 4680.812767489297, 4688.156131896258, 4494.640428765723, 4622.214223581982, 4631.814727410916, 4651.86044418668, 4677.953220467786, 4083.1629515949157, 4096.32410652242, 4100.261952848486, 4103.322951712964, 4107.219628270649, 5885.352611212763, 5905.852353691149, 5906.0, 5911.024680927641, 5917.467427931464, 5429.158480435539, 5440.700761458118, 5441.428649991773, 5447.4824891635235, 5451.809186678487, 6459.418652321314, 6462.0, 6464.838379040514, 6484.870302593922, 6489.70796314167, 4514.977425112854, 4633.675642705012, 4638.9536104638855, 4639.559241872017, 4651.418572678415, 6584.5061620378665, 6711.865762684768, 6782.321767823228, 6788.8302792430095, 6799.490038247101, 4790.640701947298, 4795.017021510582, 4801.18379875422, 4805.27920811881, 4807.975960120177, 4811.3745213122775, 4820.855374338776, 4853.39332583427, 4860.684055536379, 4869.586085182728, 5457.263269458652, 5464.153056276284, 5472.2338872557875, 5518.91721624176, 5532.5020748132865, 6364.7135878885565, 6546.378094081055, 6566.606003639797, 6571.0471981562405, 6573.572717773425, 1667.65813008333, 1709.8888572242765, 1715.5453804741753, 1717.1671739206474, 1717.4332470284776, 1072.110148576695, 1143.7026373143042, 1151.0848875144281, 1162.8197629367462, 1173.6185739634652, 6322.968385158045, 6448.290688024314, 6478.902816457757, 6485.935140648628, 6486.805395838132, 6800.299925018745, 6811.216710078305, 6819.488538359643, 6823.147106611674, 6834.1457317835275, 6451.29035806061, 6454.677266136674, 6463.192100987377, 6464.482841372679, 6470.09418681385, 3617.0595645132457, 3653.8173091345325, 3658.689011434005, 3660.633936606318, 3663.4871118043493, 6979.685914133876, 7126.394256488256, 7170.713171473083, 7209.35115839577, 7210.67551960163, 6951.7219311228, 6959.791206263719, 6974.825629359205, 6974.825629359205, 6974.860502790018, 7164.0, 7166.0, 7171.784846454615, 7195.712171513081, 7270.3456688897195, 6779.559328643622, 6815.522913396015, 6832.829179270359, 6834.043233947351, 6834.2482326943, 6485.3514648534765, 6718.428933540704, 6740.696668650021, 6743.561668491532, 6746.0, 7103.2186459488385, 7128.964355178191, 7139.714411423693, 7165.283471652793, 7174.892376614459, 4677.508861569486, 4717.198076327101, 4719.7404142772475, 4722.456917454399, 4722.574968252874, 6767.627780472121, 6791.524593278423, 6792.388685018372, 6804.829879253059, 6812.897806533005, 6342.778002769881, 6590.736370545124, 6599.670016499252, 6610.272869984394, 6613.0, 6526.477881769542, 6568.343165683394, 6576.76981305652, 6605.0, 6608.966955165193, 6424.261209960914, 6429.453496452854, 6436.485081193587, 6436.517261205335, 6449.451796597342, 6638.767643132467, 6639.203295604559, 6640.103586015826, 6648.0, 6651.467882569286, 6289.308176100717, 6471.7734879279, 6478.125453063776, 6522.543421960418, 6584.440322572444], "value": 4979.26078321903, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [807.6204184033506, 853.5476197615266, 890.7149712092131, 914.3106474549044, 926.6988228825633, 15254.923725381372, 15450.1502417367, 15468.535943921672, 15537.300821463034, 15552.300146493406, 13601.659958501043, 13956.092853964485, 13996.790048149285, 14021.228832414214, 14148.50480233192, 733.8128777161843, 855.3499340501232, 855.4610595324937, 870.2515836380724, 886.9645214191424, 887.3522328700053, 889.1952782731638, 890.6838072484272, 892.0900681305064, 893.7497500699815, 941.0589410589411, 943.170010390855, 944.504135328951, 946.2051876423802, 947.1759569174827, 784.4508843809356, 923.6028507741669, 933.9673111441135, 936.3024546712675, 937.8265020971143, 671.509797847574, 676.3946268090081, 676.9695363708645, 683.9692213850388, 684.1209046375384, 14678.0, 14698.0, 14734.631634209123, 14824.777628335583, 14826.406943722346, 15062.698746025128, 15666.0, 15673.764893526606, 15768.68462630741, 15831.525054248392, 12241.143119981516, 12477.124280251734, 12622.0, 12761.744765104739, 12868.420921058481, 3991.0820511282277, 3997.620226078518, 4007.8797636070963, 4040.696947728932, 4154.459920210384, 57369.71315143439, 57663.42336576664, 57898.131528027116, 57901.13148302779, 58232.70883645597, 11818.94090529559, 11954.820677689842, 12205.511779528719, 12210.511579536897, 12340.444679989421, 21609.891950540146, 21649.458763531038, 21658.566828663337, 21685.783142168693, 21697.13211471555, 8584.785380365416, 8642.351823613255, 8796.648134074565, 8904.821903561893, 8917.55412229386, 4930.433000204951, 4957.0, 4988.625853061035, 4990.451050384455, 5003.3495645565845, 3556.715462762973, 3557.8932632021083, 3608.0979755061235, 3608.404613238786, 3613.0, 617.7096764520668, 619.0683022051783, 626.0077776723853, 658.4699317049725, 659.5218466611764, 758.4387553210695, 800.4676889868289, 803.1005274092936, 808.7937575918103, 814.2834305810849, 9784.951075244579, 9816.656417025513, 9876.209903207726, 9911.207103431709, 9917.454540000224, 800.3557136505053, 812.29736278119, 814.6293436486385, 828.3869936247133, 834.8246868157755, 4347.478302603645, 4368.825246990148, 4527.977360113245, 4530.977345113253, 4672.995306009157, 59883.70058149769, 61953.69023154945, 62379.6881015592, 62718.68640656768, 62866.68566657137, 55489.722551386985, 55571.166432503545, 56013.439865601635, 56541.0, 56906.7154664224, 50284.0, 50304.496955030714, 50521.49478505168, 51006.74496627493, 51505.0, 8679.305655547667, 8778.078301778221, 8876.911230887608, 9059.501727405055, 9108.908910911072, 36352.45471317985, 36685.26629467449, 38844.223115536966, 39154.80422597869, 40129.79935100306, 46120.0, 47689.0, 48000.0, 48165.27752083792, 48848.75575622099, 11784.70538236551, 12039.217450865666, 12139.271643701406, 12277.508899643914, 12283.140180187658, 13890.652733681738, 14008.439662413797, 14089.788653170006, 14483.20342381137, 14485.565433036603, 10555.366677999345, 13736.244506552235, 13798.793018104938, 13891.027628065938, 14232.146071235758, 13486.325683715972, 13562.38969246406, 13768.86231137716, 13786.0, 13869.653258668613, 12990.0, 13047.543335983195, 13114.540991065267, 13333.333333333101, 13402.463901443833, 11196.440177990906, 11233.71915702114, 11250.943745281222, 11841.348725820162, 12019.519219231133, 11438.142139339749, 11516.19386642927, 11611.593594224161, 11770.705732356417, 11891.524339026342], "value": 7181.213117954359, "unit": "score"}], "name": "dromaeo_css", "value": 7500.829997499363, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 112.0, 109.0, 112.0, 110.0, 110.0, 107.0, 109.0, 108.0, 108.0], "value": 109.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 126.0, 151.0, 178.0, 132.0, 152.0, 154.0, 134.0, 181.0, 133.0], "value": 149.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 159.0, 158.0, 160.0, 161.0, 161.0, 161.0, 162.0, 161.0, 161.0], "value": 160.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 76.0, 76.0, 175.0, 74.0, 74.0, 75.0, 73.0, 157.0, 75.0], "value": 92.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 92.0, 153.0, 92.0, 92.0, 93.0, 155.0, 92.0, 92.0, 145.0], "value": 109.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 117.0, 117.0, 117.0, 117.0, 116.0, 117.0, 117.0, 117.0, 117.0], "value": 116.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 145.0, 146.0, 145.0, 146.0, 145.0, 146.0, 146.0, 145.0, 145.0], "value": 145.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 95.0, 95.0, 94.0, 94.0, 94.0, 94.0, 94.0], "value": 94.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 55.0, 55.0, 56.0, 56.0, 59.0, 57.0, 76.0, 53.0, 52.0], "value": 57.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [58.0, 59.0, 59.0, 58.0, 58.0, 57.0, 57.0, 58.0, 57.0, 58.0], "value": 57.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 80.0, 72.0, 77.0, 74.0, 74.0, 74.0, 73.0, 73.0, 77.0], "value": 74.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [120.0, 117.0, 115.0, 115.0, 109.0, 113.0, 113.0, 113.0, 131.0, 114.0], "value": 116.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 157.0, 160.0, 161.0, 159.0, 159.0, 160.0, 164.0, 159.0, 160.0], "value": 159.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 65.0, 66.0, 67.0, 65.0, 67.0, 66.0, 66.0, 65.0, 67.0], "value": 66.2, "unit": "score"}], "name": "kraken", "value": 1511.1, "alertThreshold": 2.0}]} 06:23:43 INFO - Return code: 0 06:23:43 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 06:23:43 ERROR - # TBPL SUCCESS # 06:23:43 INFO - Running post-action listener: _resource_record_post_action 06:23:43 INFO - Running post-run listener: _resource_record_post_run 06:23:44 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 20480; Write bytes: 467329024; Read time: 448; Write time: 761736 06:23:44 INFO - install - Wall time: 14s; CPU: 18.0%; Read bytes: 8192; Write bytes: 254730240; Read time: 268; Write time: 562068 06:23:44 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 12288; Write bytes: 212598784; Read time: 180; Write time: 199668 06:23:44 INFO - Running post-run listener: _upload_blobber_files 06:23:44 INFO - Blob upload gear active. 06:23:44 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:23:44 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 06:23:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 06:23:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 06:23:45 INFO - (blobuploader) - INFO - Open directory for files ... 06:23:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 06:23:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:23:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:23:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 06:23:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:23:45 INFO - (blobuploader) - INFO - Done attempting. 06:23:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 06:23:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:23:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:23:46 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 06:23:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:23:46 INFO - (blobuploader) - INFO - Done attempting. 06:23:46 INFO - (blobuploader) - INFO - Iteration through files over. 06:23:46 INFO - Return code: 0 06:23:46 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:23:46 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:23:46 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/dc9996ce477089780724ac493462f0ba2e07adf8bebfbd1e6a52a5339f5081b6072cffed3268c9c7c994e5dee447728b064c090d5667e151f04c92d1318f0410", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/723063fbb9ce438732aa7ea14ba9a627b344f92dd775544dc027d711ca63a3275fae45a8b2d1f33d4f2d9b043f1c3b097b279de92fb6cad041ae3fc7e6e65061"} 06:23:46 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:23:46 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:23:46 INFO - Contents: 06:23:46 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/dc9996ce477089780724ac493462f0ba2e07adf8bebfbd1e6a52a5339f5081b6072cffed3268c9c7c994e5dee447728b064c090d5667e151f04c92d1318f0410", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/723063fbb9ce438732aa7ea14ba9a627b344f92dd775544dc027d711ca63a3275fae45a8b2d1f33d4f2d9b043f1c3b097b279de92fb6cad041ae3fc7e6e65061"} 06:23:46 INFO - Running post-run listener: copy_logs_to_upload_dir 06:23:46 INFO - Copying logs to upload dir... 06:23:46 INFO - mkdir: /builds/slave/test/build/upload/logs 06:23:46 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1227.480643 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 27 secs) (at 2016-07-01 06:23:46.512043) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-01 06:23:46.517715) ========= 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=edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/dc9996ce477089780724ac493462f0ba2e07adf8bebfbd1e6a52a5339f5081b6072cffed3268c9c7c994e5dee447728b064c090d5667e151f04c92d1318f0410", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/723063fbb9ce438732aa7ea14ba9a627b344f92dd775544dc027d711ca63a3275fae45a8b2d1f33d4f2d9b043f1c3b097b279de92fb6cad041ae3fc7e6e65061"} build_url:https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011157 build_url: 'https://queue.taskcluster.net/v1/task/FKf0eigSS52FDgBXBKViZA/artifacts/public/build/firefox-48.0.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/dc9996ce477089780724ac493462f0ba2e07adf8bebfbd1e6a52a5339f5081b6072cffed3268c9c7c994e5dee447728b064c090d5667e151f04c92d1318f0410", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/723063fbb9ce438732aa7ea14ba9a627b344f92dd775544dc027d711ca63a3275fae45a8b2d1f33d4f2d9b043f1c3b097b279de92fb6cad041ae3fc7e6e65061"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-01 06:23:46.542950) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-01 06:23:46.543301) ========= 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=edae0fb5fee9fb758e8af6d3000002a4-1467376361.687523-1538137467 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-07-01 06:23:46.629237) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-01 06:23:46.629587) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-01 06:23:46.629960) ========= ========= Total master_lag: 0.18 =========