builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-032 starttime: 1465960898.94 results: success (0) buildid: 20160614173009 builduid: a23fa29c0da64919a916cf07973148a3 revision: 071e9554e3e76a7692fd1a24b845bc42064352b0 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:38.940803) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:38.941332) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:38.941855) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:38.964847) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:38.965160) ========= 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=745a4373a2a16df560f216e000000264-1465954094.342761-283144773 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-14 20:21:39-- 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% 63.9M=0s 2016-06-14 20:21:39 (63.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.121000 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:39.102102) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:39.102447) ========= 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=745a4373a2a16df560f216e000000264-1465954094.342761-283144773 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019452 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:39.163516) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:39.163974) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 071e9554e3e76a7692fd1a24b845bc42064352b0 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 071e9554e3e76a7692fd1a24b845bc42064352b0 --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=745a4373a2a16df560f216e000000264-1465954094.342761-283144773 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-14 20:21:39,974 truncating revision to first 12 chars 2016-06-14 20:21:39,974 Setting DEBUG logging. 2016-06-14 20:21:39,975 attempt 1/10 2016-06-14 20:21:39,975 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/071e9554e3e7?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-14 20:21:40,494 unpacking tar archive at: fx-team-071e9554e3e7/testing/mozharness/ program finished with exit code 0 elapsedTime=0.890072 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:40.084249) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:40.084617) ========= script_repo_revision: 071e9554e3e76a7692fd1a24b845bc42064352b0 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:40.085091) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:40.085396) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-14 20:21:40.094626) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-06-14 20:21:40.095050) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=745a4373a2a16df560f216e000000264-1465954094.342761-283144773 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 20:21:40 INFO - MultiFileLogger online at 20160614 20:21:40 in /builds/slave/test 20:21:40 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 20:21:40 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 20:21:40 INFO - {'append_to_log': False, 20:21:40 INFO - 'base_work_dir': '/builds/slave/test', 20:21:40 INFO - 'blob_upload_branch': 'Fx-Team', 20:21:40 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 20:21:40 INFO - 'branch': 'Fx-Team', 20:21:40 INFO - 'buildbot_json_path': 'buildprops.json', 20:21:40 INFO - 'config_files': ('talos/linux_config.py',), 20:21:40 INFO - 'default_actions': ('clobber', 20:21:40 INFO - 'read-buildbot-config', 20:21:40 INFO - 'download-and-extract', 20:21:40 INFO - 'populate-webroot', 20:21:40 INFO - 'create-virtualenv', 20:21:40 INFO - 'install', 20:21:40 INFO - 'run-tests'), 20:21:40 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 20:21:40 INFO - 'download_minidump_stackwalk': True, 20:21:40 INFO - 'download_symbols': 'ondemand', 20:21:40 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 20:21:40 INFO - 'tooltool.py': '/tools/tooltool.py', 20:21:40 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 20:21:40 INFO - '/tools/misc-python/virtualenv.py')}, 20:21:40 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 20:21:40 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 20:21:40 INFO - 'installer_path': 'installer.exe', 20:21:40 INFO - 'log_level': 'info', 20:21:40 INFO - 'log_name': 'talos', 20:21:40 INFO - 'log_to_console': True, 20:21:40 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 20:21:40 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 20:21:40 INFO - 'opt_config_files': (), 20:21:40 INFO - 'pip_index': False, 20:21:40 INFO - 'sps_profile': False, 20:21:40 INFO - 'sps_profile_interval': 0, 20:21:40 INFO - 'suite': 'dromaeojs-e10s', 20:21:40 INFO - 'system_bits': '32', 20:21:40 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 20:21:40 INFO - 'title': 'talos-linux64-ix-032', 20:21:40 INFO - 'tooltool_cache': '/builds/tooltool_cache', 20:21:40 INFO - 'use_talos_json': True, 20:21:40 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 20:21:40 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 20:21:40 INFO - 'work_dir': 'build'} 20:21:40 INFO - ##### 20:21:40 INFO - ##### Running clobber step. 20:21:40 INFO - ##### 20:21:40 INFO - Running pre-action listener: _resource_record_pre_action 20:21:40 INFO - Running main action method: clobber 20:21:40 INFO - rmtree: /builds/slave/test/build 20:21:40 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 20:21:41 INFO - Running post-action listener: _resource_record_post_action 20:21:41 INFO - ##### 20:21:41 INFO - ##### Finished clobber step (success) 20:21:41 INFO - ##### 20:21:41 INFO - ##### 20:21:41 INFO - ##### Running read-buildbot-config step. 20:21:41 INFO - ##### 20:21:41 INFO - Running pre-action listener: _resource_record_pre_action 20:21:41 INFO - Running main action method: read_buildbot_config 20:21:41 INFO - Using buildbot properties: 20:21:41 INFO - { 20:21:41 INFO - "project": "", 20:21:41 INFO - "product": "firefox", 20:21:41 INFO - "script_repo_revision": "production", 20:21:41 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 20:21:41 INFO - "repository": "", 20:21:41 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 20:21:41 INFO - "buildid": "20160614173009", 20:21:41 INFO - "pgo_build": "True", 20:21:41 INFO - "basedir": "/builds/slave/test", 20:21:41 INFO - "buildnumber": 833, 20:21:41 INFO - "slavename": "talos-linux64-ix-032", 20:21:41 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 20:21:41 INFO - "platform": "ubuntu64_hw", 20:21:41 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 20:21:41 INFO - "branch": "fx-team", 20:21:41 INFO - "repo_path": "integration/fx-team", 20:21:41 INFO - "revision": "071e9554e3e76a7692fd1a24b845bc42064352b0", 20:21:41 INFO - "stage_platform": "linux64-pgo", 20:21:41 INFO - "builduid": "a23fa29c0da64919a916cf07973148a3", 20:21:41 INFO - "slavebuilddir": "test" 20:21:41 INFO - } 20:21:41 INFO - Found installer url https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 20:21:41 INFO - Running post-action listener: _resource_record_post_action 20:21:41 INFO - ##### 20:21:41 INFO - ##### Finished read-buildbot-config step (success) 20:21:41 INFO - ##### 20:21:41 INFO - ##### 20:21:41 INFO - ##### Running download-and-extract step. 20:21:41 INFO - ##### 20:21:41 INFO - Running pre-action listener: _resource_record_pre_action 20:21:41 INFO - Running main action method: download_and_extract 20:21:41 INFO - mkdir: /builds/slave/test/build/tests 20:21:41 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')]} 20:21:41 INFO - https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 20:21:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 20:21:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 20:21:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 20:21:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 20:21:44 INFO - Downloaded 1361 bytes. 20:21:44 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 20:21:44 INFO - Using the following test package requirements: 20:21:44 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 20:21:44 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:21:44 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 20:21:44 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:21:44 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 20:21:44 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:21:44 INFO - u'jsshell-linux-x86_64.zip'], 20:21:44 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:21:44 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 20:21:44 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 20:21:44 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:21:44 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 20:21:44 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:21:44 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 20:21:44 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:21:44 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 20:21:44 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 20:21:44 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 20:21:44 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 20:21:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:21:44 INFO - https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 20:21:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:21:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:21:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:21:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 20:21:45 INFO - Downloaded 24220471 bytes. 20:21:45 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 20:21:45 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 20:21:46 INFO - Return code: 0 20:21:46 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 20:21:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:21:46 INFO - https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 20:21:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:21:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:21:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 20:21:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 20:21:48 INFO - Downloaded 24220471 bytes. 20:21:48 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 20:21:48 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 20:21:50 INFO - Return code: 0 20:21:50 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')]} 20:21:50 INFO - https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 20:21:50 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 20:21:50 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 20:21:50 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 20:21:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 20:21:51 INFO - Downloaded 14405384 bytes. 20:21:51 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 20:21:51 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 20:21:51 INFO - Return code: 0 20:21:51 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')]} 20:21:51 INFO - https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 20:21:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:21:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:21:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:21:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 20:21:52 INFO - Downloaded 59340302 bytes. 20:21:52 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:21:52 INFO - mkdir: /builds/slave/test/properties 20:21:52 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 20:21:52 INFO - Writing to file /builds/slave/test/properties/build_url 20:21:52 INFO - Contents: 20:21:52 INFO - build_url:https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 20:21:53 INFO - Running post-action listener: _resource_record_post_action 20:21:53 INFO - Running post-action listener: set_extra_try_arguments 20:21:53 INFO - ##### 20:21:53 INFO - ##### Finished download-and-extract step (success) 20:21:53 INFO - ##### 20:21:53 INFO - ##### 20:21:53 INFO - ##### Running populate-webroot step. 20:21:53 INFO - ##### 20:21:53 INFO - Running pre-action listener: _resource_record_pre_action 20:21:53 INFO - Running main action method: populate_webroot 20:21:53 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 20:21:53 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 20:21:53 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 20:21:53 INFO - '--tppagecycles', 20:21:53 INFO - '7'], 20:21:53 INFO - 'tests': ['tsvgm']}}, 20:21:53 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 20:21:53 INFO - 'tests': ['tresize', 'tcanvasmark']}, 20:21:53 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 20:21:53 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 20:21:53 INFO - 'tests': ['dromaeo_css', 'kraken']}, 20:21:53 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 20:21:53 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:21:53 INFO - 'talos_options': ['--disable-e10s'], 20:21:53 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 20:21:53 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:21:53 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 20:21:53 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:21:53 INFO - 'talos_options': ['--disable-e10s'], 20:21:53 INFO - 'tests': ['damp', 'tps']}, 20:21:53 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:21:53 INFO - 'tests': ['damp', 'tps']}, 20:21:53 INFO - 'g3': {'talos_options': ['--disable-e10s'], 20:21:53 INFO - 'tests': ['dromaeo_dom']}, 20:21:53 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 20:21:53 INFO - 'g4': {'talos_options': ['--disable-e10s'], 20:21:53 INFO - 'tests': ['basic_compositor_video']}, 20:21:53 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 20:21:53 INFO - 'other': {'talos_options': ['--disable-e10s'], 20:21:53 INFO - 'tests': ['a11yr', 20:21:53 INFO - 'ts_paint', 20:21:53 INFO - 'tpaint', 20:21:53 INFO - 'sessionrestore', 20:21:53 INFO - 'sessionrestore_no_auto_restore', 20:21:53 INFO - 'tabpaint']}, 20:21:53 INFO - 'other-e10s': {'tests': ['a11yr', 20:21:53 INFO - 'ts_paint', 20:21:53 INFO - 'tpaint', 20:21:53 INFO - 'sessionrestore', 20:21:53 INFO - 'sessionrestore_no_auto_restore', 20:21:53 INFO - 'tabpaint']}, 20:21:53 INFO - 'other-e10s_l64': {'tests': ['a11yr', 20:21:53 INFO - 'ts_paint', 20:21:53 INFO - 'tpaint', 20:21:53 INFO - 'sessionrestore', 20:21:53 INFO - 'sessionrestore_no_auto_restore', 20:21:53 INFO - 'tabpaint']}, 20:21:53 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 20:21:53 INFO - 'ts_paint', 20:21:53 INFO - 'tpaint', 20:21:53 INFO - 'sessionrestore', 20:21:53 INFO - 'sessionrestore_no_auto_restore', 20:21:53 INFO - 'tabpaint']}, 20:21:53 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 20:21:53 INFO - 'tests': ['a11yr', 20:21:53 INFO - 'ts_paint', 20:21:53 INFO - 'tpaint', 20:21:53 INFO - 'sessionrestore', 20:21:53 INFO - 'sessionrestore_no_auto_restore', 20:21:53 INFO - 'tabpaint']}, 20:21:53 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 20:21:53 INFO - 'tests': ['a11yr', 20:21:53 INFO - 'ts_paint', 20:21:53 INFO - 'tpaint', 20:21:53 INFO - 'sessionrestore', 20:21:53 INFO - 'sessionrestore_no_auto_restore', 20:21:53 INFO - 'tabpaint']}, 20:21:53 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 20:21:53 INFO - 'tests': ['tsvgx', 20:21:53 INFO - 'tsvgr_opacity', 20:21:53 INFO - 'tart', 20:21:53 INFO - 'tscrollx', 20:21:53 INFO - 'cart']}, 20:21:53 INFO - 'svgr-e10s': {'tests': ['tsvgx', 20:21:53 INFO - 'tsvgr_opacity', 20:21:53 INFO - 'tart', 20:21:53 INFO - 'tscrollx', 20:21:53 INFO - 'cart']}, 20:21:53 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:21:53 INFO - 'talos_options': ['--disable-e10s'], 20:21:53 INFO - 'tests': ['tp5o']}, 20:21:53 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:21:53 INFO - 'tests': ['tp5o']}, 20:21:53 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:21:53 INFO - 'talos_options': ['--disable-e10s', 20:21:53 INFO - '--xperf_path', 20:21:53 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 20:21:53 INFO - 'tests': ['tp5n']}, 20:21:53 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 20:21:53 INFO - 'talos_options': ['--xperf_path', 20:21:53 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 20:21:53 INFO - 'tests': ['tp5n']}}, 20:21:53 INFO - 'talos.zip': {'path': '', 20:21:53 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 20:21:53 INFO - Running post-action listener: _resource_record_post_action 20:21:53 INFO - ##### 20:21:53 INFO - ##### Finished populate-webroot step (success) 20:21:53 INFO - ##### 20:21:53 INFO - ##### 20:21:53 INFO - ##### Running create-virtualenv step. 20:21:53 INFO - ##### 20:21:53 INFO - Running pre-action listener: _resource_record_pre_action 20:21:53 INFO - Running main action method: create_virtualenv 20:21:53 INFO - Creating virtualenv /builds/slave/test/build/venv 20:21:53 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 20:21:53 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 20:21:53 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 20:21:53 INFO - Using real prefix '/usr' 20:21:53 INFO - New python executable in /builds/slave/test/build/venv/bin/python 20:21:54 INFO - Installing distribute.............................................................................................................................................................................................done. 20:21:56 INFO - Installing pip.................done. 20:21:56 INFO - Return code: 0 20:21:56 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 20:21:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:21:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:21:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:21:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:21:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:21:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:21:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9ab3a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1faf350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203e1c0>, '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 0x203f0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203f550>, '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': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', '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 20:21:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 20:21:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 20:21:56 INFO - Using env: {'DISPLAY': ':0', 20:21:56 INFO - 'HOME': '/home/cltbld', 20:21:56 INFO - 'LANG': 'en_US.UTF-8', 20:21:56 INFO - 'LANGUAGE': 'en_US:en', 20:21:56 INFO - 'LOGNAME': 'cltbld', 20:21:56 INFO - 'MAIL': '/var/mail/cltbld', 20:21:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:21:56 INFO - 'MOZ_NO_REMOTE': '1', 20:21:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:21:56 INFO - 'NO_EM_RESTART': '1', 20:21:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:21:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:21:56 INFO - 'PWD': '/builds/slave/test', 20:21:56 INFO - 'SHELL': '/bin/bash', 20:21:56 INFO - 'SHLVL': '1', 20:21:56 INFO - 'TERM': 'linux', 20:21:56 INFO - 'TMOUT': '86400', 20:21:56 INFO - 'USER': 'cltbld', 20:21:56 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', 20:21:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:21:56 INFO - '_': '/tools/buildbot/bin/python'} 20:21:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:21:56 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 20:21:56 INFO - Cleaning up... 20:21:56 INFO - Return code: 0 20:21:56 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 20:21:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:21:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:21:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:21:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:21:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:21:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:21:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9ab3a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1faf350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203e1c0>, '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 0x203f0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203f550>, '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': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', '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 20:21:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 20:21:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 20:21:56 INFO - Using env: {'DISPLAY': ':0', 20:21:56 INFO - 'HOME': '/home/cltbld', 20:21:56 INFO - 'LANG': 'en_US.UTF-8', 20:21:56 INFO - 'LANGUAGE': 'en_US:en', 20:21:56 INFO - 'LOGNAME': 'cltbld', 20:21:56 INFO - 'MAIL': '/var/mail/cltbld', 20:21:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:21:56 INFO - 'MOZ_NO_REMOTE': '1', 20:21:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:21:56 INFO - 'NO_EM_RESTART': '1', 20:21:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:21:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:21:56 INFO - 'PWD': '/builds/slave/test', 20:21:56 INFO - 'SHELL': '/bin/bash', 20:21:56 INFO - 'SHLVL': '1', 20:21:56 INFO - 'TERM': 'linux', 20:21:56 INFO - 'TMOUT': '86400', 20:21:56 INFO - 'USER': 'cltbld', 20:21:56 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', 20:21:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:21:56 INFO - '_': '/tools/buildbot/bin/python'} 20:21:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:21:56 INFO - Downloading/unpacking psutil>=3.1.1 20:21:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:21:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:21:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:21:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:21:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:21:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:21:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 20:21:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 20:21:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 20:21:58 INFO - Installing collected packages: psutil 20:21:58 INFO - Running setup.py install for psutil 20:21:58 INFO - building 'psutil._psutil_linux' extension 20:21:58 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 20:21:59 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 20:21:59 INFO - building 'psutil._psutil_posix' extension 20:21:59 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 20:21:59 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 20:21:59 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 20:21:59 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 20:21:59 INFO - Successfully installed psutil 20:21:59 INFO - Cleaning up... 20:21:59 INFO - Return code: 0 20:21:59 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 20:21:59 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')]} 20:21:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:21:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:21:59 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')]} 20:21:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:21:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:21:59 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.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9ab3a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1faf350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203e1c0>, '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 0x203f0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203f550>, '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': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', '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 20:21:59 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.3'] in /builds/slave/test/build 20:21:59 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.3 20:21:59 INFO - Using env: {'DISPLAY': ':0', 20:21:59 INFO - 'HOME': '/home/cltbld', 20:21:59 INFO - 'LANG': 'en_US.UTF-8', 20:21:59 INFO - 'LANGUAGE': 'en_US:en', 20:21:59 INFO - 'LOGNAME': 'cltbld', 20:21:59 INFO - 'MAIL': '/var/mail/cltbld', 20:21:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:21:59 INFO - 'MOZ_NO_REMOTE': '1', 20:21:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:21:59 INFO - 'NO_EM_RESTART': '1', 20:21:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:21:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:21:59 INFO - 'PWD': '/builds/slave/test', 20:21:59 INFO - 'SHELL': '/bin/bash', 20:21:59 INFO - 'SHLVL': '1', 20:21:59 INFO - 'TERM': 'linux', 20:21:59 INFO - 'TMOUT': '86400', 20:21:59 INFO - 'USER': 'cltbld', 20:21:59 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', 20:21:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:21:59 INFO - '_': '/tools/buildbot/bin/python'} 20:21:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:21:59 INFO - Downloading/unpacking mozsystemmonitor==0.3 20:21:59 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 20:21:59 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 20:21:59 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 20:21:59 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 20:21:59 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 20:21:59 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 20:22:01 INFO - Downloading mozsystemmonitor-0.3.tar.gz 20:22:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 20:22:01 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 20:22:01 INFO - Installing collected packages: mozsystemmonitor 20:22:01 INFO - Running setup.py install for mozsystemmonitor 20:22:01 INFO - Successfully installed mozsystemmonitor 20:22:01 INFO - Cleaning up... 20:22:01 INFO - Return code: 0 20:22:01 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 20:22:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:22:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:22:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:22:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:22:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:01 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==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd9ab3a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1faf350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203e1c0>, '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 0x203f0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203f550>, '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': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', '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 20:22:01 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==2.5.1'] in /builds/slave/test/build 20:22:01 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==2.5.1 20:22:01 INFO - Using env: {'DISPLAY': ':0', 20:22:01 INFO - 'HOME': '/home/cltbld', 20:22:01 INFO - 'LANG': 'en_US.UTF-8', 20:22:01 INFO - 'LANGUAGE': 'en_US:en', 20:22:01 INFO - 'LOGNAME': 'cltbld', 20:22:01 INFO - 'MAIL': '/var/mail/cltbld', 20:22:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:22:01 INFO - 'MOZ_NO_REMOTE': '1', 20:22:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:22:01 INFO - 'NO_EM_RESTART': '1', 20:22:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:22:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:22:01 INFO - 'PWD': '/builds/slave/test', 20:22:01 INFO - 'SHELL': '/bin/bash', 20:22:01 INFO - 'SHLVL': '1', 20:22:01 INFO - 'TERM': 'linux', 20:22:01 INFO - 'TMOUT': '86400', 20:22:01 INFO - 'USER': 'cltbld', 20:22:01 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', 20:22:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:22:01 INFO - '_': '/tools/buildbot/bin/python'} 20:22:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:22:01 INFO - Downloading/unpacking jsonschema==2.5.1 20:22:01 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 20:22:01 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 20:22:01 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 20:22:01 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 20:22:01 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 20:22:01 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 20:22:03 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 20:22:03 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 20:22:03 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 20:22:03 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 20:22:03 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 20:22:03 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 20:22:03 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 20:22:03 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 20:22:03 INFO - Downloading functools32-3.2.3-2.tar.gz 20:22:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 20:22:03 INFO - warning: no files found matching '*.txt' 20:22:03 INFO - no previously-included directories found matching 'build' 20:22:03 INFO - no previously-included directories found matching 'dist' 20:22:03 INFO - no previously-included directories found matching '.git*' 20:22:03 INFO - Installing collected packages: jsonschema, functools32 20:22:04 INFO - Running setup.py install for functools32 20:22:04 INFO - warning: no files found matching '*.txt' 20:22:04 INFO - no previously-included directories found matching 'build' 20:22:04 INFO - no previously-included directories found matching 'dist' 20:22:04 INFO - no previously-included directories found matching '.git*' 20:22:04 INFO - Successfully installed jsonschema functools32 20:22:04 INFO - Cleaning up... 20:22:04 INFO - Return code: 0 20:22:04 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 20:22:04 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')]} 20:22:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:22:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:04 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')]} 20:22:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:22:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:04 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 0x7fd9ab3a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1faf350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203e1c0>, '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 0x203f0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203f550>, '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': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', '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 20:22:04 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 20:22:04 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 20:22:04 INFO - Using env: {'DISPLAY': ':0', 20:22:04 INFO - 'HOME': '/home/cltbld', 20:22:04 INFO - 'LANG': 'en_US.UTF-8', 20:22:04 INFO - 'LANGUAGE': 'en_US:en', 20:22:04 INFO - 'LOGNAME': 'cltbld', 20:22:04 INFO - 'MAIL': '/var/mail/cltbld', 20:22:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:22:04 INFO - 'MOZ_NO_REMOTE': '1', 20:22:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:22:04 INFO - 'NO_EM_RESTART': '1', 20:22:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:22:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:22:04 INFO - 'PWD': '/builds/slave/test', 20:22:04 INFO - 'SHELL': '/bin/bash', 20:22:04 INFO - 'SHLVL': '1', 20:22:04 INFO - 'TERM': 'linux', 20:22:04 INFO - 'TMOUT': '86400', 20:22:04 INFO - 'USER': 'cltbld', 20:22:04 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', 20:22:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:22:04 INFO - '_': '/tools/buildbot/bin/python'} 20:22:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:22:04 INFO - Downloading/unpacking blobuploader==1.2.4 20:22:04 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 20:22:04 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 20:22:04 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 20:22:04 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 20:22:04 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 20:22:04 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 20:22:06 INFO - Downloading blobuploader-1.2.4.tar.gz 20:22:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 20:22:06 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 20:22:06 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 20:22:06 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 20:22:06 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 20:22:06 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 20:22:06 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 20:22:06 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 20:22:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 20:22:06 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 20:22:06 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 20:22:06 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 20:22:06 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 20:22:06 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 20:22:06 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 20:22:06 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 20:22:06 INFO - Downloading docopt-0.6.1.tar.gz 20:22:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 20:22:07 INFO - Installing collected packages: blobuploader, requests, docopt 20:22:07 INFO - Running setup.py install for blobuploader 20:22:07 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 20:22:07 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 20:22:07 INFO - Running setup.py install for requests 20:22:07 INFO - Running setup.py install for docopt 20:22:07 INFO - Successfully installed blobuploader requests docopt 20:22:07 INFO - Cleaning up... 20:22:07 INFO - Return code: 0 20:22:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 20:22:07 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')]} 20:22:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:22:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:07 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')]} 20:22:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:22:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:07 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 0x7fd9ab3a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1faf350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203e1c0>, '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 0x203f0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203f550>, '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': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', '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 20:22:07 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 20:22:07 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 20:22:07 INFO - Using env: {'DISPLAY': ':0', 20:22:07 INFO - 'HOME': '/home/cltbld', 20:22:07 INFO - 'LANG': 'en_US.UTF-8', 20:22:07 INFO - 'LANGUAGE': 'en_US:en', 20:22:07 INFO - 'LOGNAME': 'cltbld', 20:22:07 INFO - 'MAIL': '/var/mail/cltbld', 20:22:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:22:07 INFO - 'MOZ_NO_REMOTE': '1', 20:22:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:22:07 INFO - 'NO_EM_RESTART': '1', 20:22:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:22:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:22:07 INFO - 'PWD': '/builds/slave/test', 20:22:07 INFO - 'SHELL': '/bin/bash', 20:22:07 INFO - 'SHLVL': '1', 20:22:07 INFO - 'TERM': 'linux', 20:22:07 INFO - 'TMOUT': '86400', 20:22:07 INFO - 'USER': 'cltbld', 20:22:07 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', 20:22:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:22:07 INFO - '_': '/tools/buildbot/bin/python'} 20:22:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 20:22:07 INFO - Running setup.py (path:/tmp/pip-ZMubON-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 20:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 20:22:07 INFO - Running setup.py (path:/tmp/pip-XC5vrN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 20:22:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 20:22:07 INFO - Running setup.py (path:/tmp/pip-megbhD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 20:22:08 INFO - Running setup.py (path:/tmp/pip-XSRcoj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 20:22:08 INFO - Running setup.py (path:/tmp/pip-lCPmM4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 20:22:08 INFO - Running setup.py (path:/tmp/pip-rc4LcR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 20:22:08 INFO - Running setup.py (path:/tmp/pip-5WBTyr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 20:22:08 INFO - Running setup.py (path:/tmp/pip-oYwBkk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 20:22:08 INFO - Running setup.py (path:/tmp/pip-0jt5kC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 20:22:08 INFO - Running setup.py (path:/tmp/pip-G0GP20-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 20:22:08 INFO - Running setup.py (path:/tmp/pip-JmlpjY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 20:22:08 INFO - Running setup.py (path:/tmp/pip-jmYN2_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 20:22:08 INFO - Running setup.py (path:/tmp/pip-oyw2Zg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 20:22:08 INFO - Running setup.py (path:/tmp/pip-PM8Nj1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 20:22:08 INFO - Running setup.py (path:/tmp/pip-9LC5nV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 20:22:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 20:22:08 INFO - Running setup.py (path:/tmp/pip-QtwVeG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 20:22:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 20:22:09 INFO - Running setup.py (path:/tmp/pip-ih666G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 20:22:09 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 20:22:09 INFO - Running setup.py install for manifestparser 20:22:09 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 20:22:09 INFO - Running setup.py install for mozcrash 20:22:09 INFO - Running setup.py install for mozdebug 20:22:09 INFO - Running setup.py install for mozdevice 20:22:09 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 20:22:09 INFO - Installing dm script to /builds/slave/test/build/venv/bin 20:22:09 INFO - Running setup.py install for mozfile 20:22:09 INFO - Running setup.py install for mozhttpd 20:22:09 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 20:22:09 INFO - Running setup.py install for mozinfo 20:22:09 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 20:22:09 INFO - Running setup.py install for mozInstall 20:22:09 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 20:22:09 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 20:22:09 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 20:22:09 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 20:22:09 INFO - Running setup.py install for mozleak 20:22:09 INFO - Running setup.py install for mozlog 20:22:10 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 20:22:10 INFO - Running setup.py install for moznetwork 20:22:10 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 20:22:10 INFO - Running setup.py install for mozprocess 20:22:10 INFO - Running setup.py install for mozprofile 20:22:10 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 20:22:10 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 20:22:10 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 20:22:10 INFO - Running setup.py install for mozrunner 20:22:10 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 20:22:10 INFO - Running setup.py install for mozscreenshot 20:22:10 INFO - Running setup.py install for moztest 20:22:10 INFO - Running setup.py install for mozversion 20:22:10 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 20:22:10 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 20:22:10 INFO - Cleaning up... 20:22:10 INFO - Return code: 0 20:22:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 20:22:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:22:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:22:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:22:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:22:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:10 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 0x7fd9ab3a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1faf350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203e1c0>, '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 0x203f0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203f550>, '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': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', '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 20:22:10 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 20:22:10 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 20:22:10 INFO - Using env: {'DISPLAY': ':0', 20:22:10 INFO - 'HOME': '/home/cltbld', 20:22:10 INFO - 'LANG': 'en_US.UTF-8', 20:22:10 INFO - 'LANGUAGE': 'en_US:en', 20:22:10 INFO - 'LOGNAME': 'cltbld', 20:22:10 INFO - 'MAIL': '/var/mail/cltbld', 20:22:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:22:10 INFO - 'MOZ_NO_REMOTE': '1', 20:22:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:22:10 INFO - 'NO_EM_RESTART': '1', 20:22:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:22:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:22:10 INFO - 'PWD': '/builds/slave/test', 20:22:10 INFO - 'SHELL': '/bin/bash', 20:22:10 INFO - 'SHLVL': '1', 20:22:10 INFO - 'TERM': 'linux', 20:22:10 INFO - 'TMOUT': '86400', 20:22:10 INFO - 'USER': 'cltbld', 20:22:10 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', 20:22:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:22:10 INFO - '_': '/tools/buildbot/bin/python'} 20:22:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 20:22:11 INFO - Running setup.py (path:/tmp/pip-hO3vhh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 20:22:11 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)) 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 20:22:11 INFO - Running setup.py (path:/tmp/pip-cSu137-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 20:22:11 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)) 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 20:22:11 INFO - Running setup.py (path:/tmp/pip-i3hX4D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 20:22:11 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)) 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 20:22:11 INFO - Running setup.py (path:/tmp/pip-Hdel5y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 20:22:11 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)) 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 20:22:11 INFO - Running setup.py (path:/tmp/pip-OIm6ZY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 20:22:11 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)) 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 20:22:11 INFO - Running setup.py (path:/tmp/pip-NiwTVq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 20:22:11 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)) 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 20:22:11 INFO - Running setup.py (path:/tmp/pip-tWcpAH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 20:22:11 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)) 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 20:22:11 INFO - Running setup.py (path:/tmp/pip-MV9SWc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 20:22:11 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)) 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 20:22:11 INFO - Running setup.py (path:/tmp/pip-mIsTNp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 20:22:11 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)) 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 20:22:11 INFO - Running setup.py (path:/tmp/pip-En8VcU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 20:22:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 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)) 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 20:22:11 INFO - Running setup.py (path:/tmp/pip-dFQTyg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 20:22:11 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)) 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 20:22:11 INFO - Running setup.py (path:/tmp/pip-8NSVd_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 20:22:11 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)) 20:22:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 20:22:11 INFO - Running setup.py (path:/tmp/pip-qbh_wo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 20:22:12 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)) 20:22:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 20:22:12 INFO - Running setup.py (path:/tmp/pip-nVFTzc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 20:22:12 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)) 20:22:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 20:22:12 INFO - Running setup.py (path:/tmp/pip-fCJxb9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 20:22:12 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)) 20:22:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 20:22:12 INFO - Running setup.py (path:/tmp/pip-4p3ESI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 20:22:12 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)) 20:22:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 20:22:12 INFO - Running setup.py (path:/tmp/pip-HK9XqN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 20:22:12 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)) 20:22:12 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)) 20:22:12 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)) 20:22:12 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)) 20:22:12 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)) 20:22:12 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)) 20:22:12 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 20:22:12 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 20:22:12 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 20:22:12 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 20:22:12 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 20:22:12 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 20:22:12 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 20:22:14 INFO - Downloading blessings-1.6.tar.gz 20:22:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 20:22:14 INFO - Installing collected packages: blessings 20:22:14 INFO - Running setup.py install for blessings 20:22:14 INFO - Successfully installed blessings 20:22:14 INFO - Cleaning up... 20:22:14 INFO - Return code: 0 20:22:14 INFO - Done creating virtualenv /builds/slave/test/build/venv. 20:22:14 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 20:22:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 20:22:14 INFO - Reading from file tmpfile_stdout 20:22:14 INFO - Current package versions: 20:22:14 INFO - argparse == 1.2.1 20:22:14 INFO - blessings == 1.6 20:22:14 INFO - blobuploader == 1.2.4 20:22:14 INFO - docopt == 0.6.1 20:22:14 INFO - functools32 == 3.2.3-2 20:22:14 INFO - jsonschema == 2.5.1 20:22:14 INFO - manifestparser == 1.1 20:22:14 INFO - mozInstall == 1.12 20:22:14 INFO - mozcrash == 0.17 20:22:14 INFO - mozdebug == 0.1 20:22:14 INFO - mozdevice == 0.48 20:22:14 INFO - mozfile == 1.2 20:22:14 INFO - mozhttpd == 0.7 20:22:14 INFO - mozinfo == 0.9 20:22:14 INFO - mozleak == 0.1 20:22:14 INFO - mozlog == 3.2 20:22:14 INFO - moznetwork == 0.27 20:22:14 INFO - mozprocess == 0.22 20:22:14 INFO - mozprofile == 0.28 20:22:14 INFO - mozrunner == 6.11 20:22:14 INFO - mozscreenshot == 0.1 20:22:14 INFO - mozsystemmonitor == 0.3 20:22:14 INFO - moztest == 0.7 20:22:14 INFO - mozversion == 1.4 20:22:14 INFO - psutil == 3.1.1 20:22:14 INFO - requests == 1.2.3 20:22:14 INFO - wsgiref == 0.1.2 20:22:14 INFO - Installing None into virtualenv /builds/slave/test/build/venv 20:22:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:22:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:22:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:22:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:22:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:14 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 0x7fd9ab3a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1faf350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203e1c0>, '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 0x203f0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203f550>, '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': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', '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 20:22:14 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 20:22:14 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 20:22:14 INFO - Using env: {'DISPLAY': ':0', 20:22:14 INFO - 'HOME': '/home/cltbld', 20:22:14 INFO - 'LANG': 'en_US.UTF-8', 20:22:14 INFO - 'LANGUAGE': 'en_US:en', 20:22:14 INFO - 'LOGNAME': 'cltbld', 20:22:14 INFO - 'MAIL': '/var/mail/cltbld', 20:22:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:22:14 INFO - 'MOZ_NO_REMOTE': '1', 20:22:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:22:14 INFO - 'NO_EM_RESTART': '1', 20:22:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:22:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:22:14 INFO - 'PWD': '/builds/slave/test', 20:22:14 INFO - 'SHELL': '/bin/bash', 20:22:14 INFO - 'SHLVL': '1', 20:22:14 INFO - 'TERM': 'linux', 20:22:14 INFO - 'TMOUT': '86400', 20:22:14 INFO - 'USER': 'cltbld', 20:22:14 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', 20:22:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:22:14 INFO - '_': '/tools/buildbot/bin/python'} 20:22:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:22:14 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)) 20:22:14 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)) 20:22:14 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)) 20:22:14 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)) 20:22:14 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)) 20:22:14 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)) 20:22:14 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)) 20:22:14 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)) 20:22:14 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)) 20:22:14 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)) 20:22:14 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)) 20:22:14 INFO - Cleaning up... 20:22:14 INFO - Return code: 0 20:22:14 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 20:22:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:22:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:22:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:22:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:22:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:14 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 0x7fd9ab3a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1faf350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203e1c0>, '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 0x203f0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203f550>, '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': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', '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 20:22:14 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 20:22:14 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 20:22:14 INFO - Using env: {'DISPLAY': ':0', 20:22:14 INFO - 'HOME': '/home/cltbld', 20:22:14 INFO - 'LANG': 'en_US.UTF-8', 20:22:14 INFO - 'LANGUAGE': 'en_US:en', 20:22:14 INFO - 'LOGNAME': 'cltbld', 20:22:14 INFO - 'MAIL': '/var/mail/cltbld', 20:22:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:22:14 INFO - 'MOZ_NO_REMOTE': '1', 20:22:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:22:14 INFO - 'NO_EM_RESTART': '1', 20:22:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:22:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:22:14 INFO - 'PWD': '/builds/slave/test', 20:22:14 INFO - 'SHELL': '/bin/bash', 20:22:14 INFO - 'SHLVL': '1', 20:22:14 INFO - 'TERM': 'linux', 20:22:14 INFO - 'TMOUT': '86400', 20:22:14 INFO - 'USER': 'cltbld', 20:22:14 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', 20:22:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:22:14 INFO - '_': '/tools/buildbot/bin/python'} 20:22:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:22:15 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 20:22:15 INFO - Cleaning up... 20:22:15 INFO - Return code: 0 20:22:15 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 20:22:15 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')]} 20:22:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 20:22:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:15 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')]} 20:22:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 20:22:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 20:22:15 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 0x7fd9ab3a0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee48a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1faf350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203e1c0>, '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 0x203f0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203f550>, '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': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', '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 20:22:15 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 20:22:15 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 20:22:15 INFO - Using env: {'DISPLAY': ':0', 20:22:15 INFO - 'HOME': '/home/cltbld', 20:22:15 INFO - 'LANG': 'en_US.UTF-8', 20:22:15 INFO - 'LANGUAGE': 'en_US:en', 20:22:15 INFO - 'LOGNAME': 'cltbld', 20:22:15 INFO - 'MAIL': '/var/mail/cltbld', 20:22:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:22:15 INFO - 'MOZ_NO_REMOTE': '1', 20:22:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:22:15 INFO - 'NO_EM_RESTART': '1', 20:22:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:22:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:22:15 INFO - 'PWD': '/builds/slave/test', 20:22:15 INFO - 'SHELL': '/bin/bash', 20:22:15 INFO - 'SHLVL': '1', 20:22:15 INFO - 'TERM': 'linux', 20:22:15 INFO - 'TMOUT': '86400', 20:22:15 INFO - 'USER': 'cltbld', 20:22:15 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', 20:22:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:22:15 INFO - '_': '/tools/buildbot/bin/python'} 20:22:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 20:22:15 INFO - Downloading/unpacking flake8 20:22:15 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 20:22:15 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 20:22:15 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 20:22:15 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 20:22:15 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 20:22:15 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 20:22:17 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 20:22:17 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 20:22:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:22:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:22:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:22:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:22:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:22:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:22:17 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 20:22:17 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 20:22:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:22:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:22:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:22:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:22:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:22:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:22:17 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 20:22:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:22:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:22:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:22:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 20:22:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 20:22:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 20:22:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 20:22:17 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 20:22:17 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 20:22:17 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 20:22:17 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 20:22:17 INFO - no previously-included directories found matching 'docs/_build' 20:22:17 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 20:22:18 INFO - Running setup.py install for pep8 20:22:18 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 20:22:18 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 20:22:18 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 20:22:18 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 20:22:18 INFO - no previously-included directories found matching 'docs/_build' 20:22:18 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 20:22:18 INFO - Successfully installed flake8 mccabe pyflakes pep8 20:22:18 INFO - Cleaning up... 20:22:18 INFO - Return code: 0 20:22:18 INFO - Running post-action listener: _resource_record_post_action 20:22:18 INFO - Running post-action listener: _start_resource_monitoring 20:22:18 INFO - Starting resource monitoring. 20:22:18 INFO - ##### 20:22:18 INFO - ##### Finished create-virtualenv step (success) 20:22:18 INFO - ##### 20:22:18 INFO - ##### 20:22:18 INFO - ##### Running install step. 20:22:18 INFO - ##### 20:22:18 INFO - Running pre-action listener: _resource_record_pre_action 20:22:18 INFO - Running main action method: install 20:22:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 20:22:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 20:22:18 INFO - Reading from file tmpfile_stdout 20:22:18 INFO - Detecting whether we're running mozinstall >=1.0... 20:22:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 20:22:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 20:22:18 INFO - Reading from file tmpfile_stdout 20:22:18 INFO - Output received: 20:22:18 INFO - Usage: mozinstall [options] installer 20:22:18 INFO - Options: 20:22:18 INFO - -h, --help show this help message and exit 20:22:18 INFO - -d DEST, --destination=DEST 20:22:18 INFO - Directory to install application into. [default: 20:22:18 INFO - "/builds/slave/test"] 20:22:18 INFO - --app=APP Application being installed. [default: firefox] 20:22:18 INFO - mkdir: /builds/slave/test/build/application 20:22:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 20:22:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 20:22:35 INFO - Reading from file tmpfile_stdout 20:22:35 INFO - Output received: 20:22:35 INFO - /builds/slave/test/build/application/firefox/firefox 20:22:35 INFO - Running post-action listener: _resource_record_post_action 20:22:35 INFO - ##### 20:22:35 INFO - ##### Finished install step (success) 20:22:35 INFO - ##### 20:22:35 INFO - ##### 20:22:35 INFO - ##### Running run-tests step. 20:22:35 INFO - ##### 20:22:35 INFO - Running pre-action listener: _resource_record_pre_action 20:22:35 INFO - Running main action method: run_tests 20:22:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 20:22:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 20:22:35 INFO - Python 2.7.3 20:22:35 INFO - Return code: 0 20:22:35 INFO - grabbing minidump binary from tooltool 20:22:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 20:22:35 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: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x203e1c0>, '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 0x203f0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x203f550>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 20:22:35 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 20:22:35 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 20:22:35 INFO - Calling ['/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'] with output_timeout 600 20:22:35 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 20:22:35 INFO - Return code: 0 20:22:35 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 20:22:35 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 20:22:35 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 20:22:35 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 20:22:35 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 20:22:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 20:22:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 20:22:36 INFO - Return code: 0 20:22:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-032', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 20:22:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-032 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 20:22:36 INFO - Using env: {'DISPLAY': ':0', 20:22:36 INFO - 'HOME': '/home/cltbld', 20:22:36 INFO - 'LANG': 'en_US.UTF-8', 20:22:36 INFO - 'LANGUAGE': 'en_US:en', 20:22:36 INFO - 'LOGNAME': 'cltbld', 20:22:36 INFO - 'MAIL': '/var/mail/cltbld', 20:22:36 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 20:22:36 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 20:22:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 20:22:36 INFO - 'MOZ_NO_REMOTE': '1', 20:22:36 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 20:22:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 20:22:36 INFO - 'NO_EM_RESTART': '1', 20:22:36 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 20:22:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 20:22:36 INFO - 'PWD': '/builds/slave/test', 20:22:36 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 20:22:36 INFO - 'SHELL': '/bin/bash', 20:22:36 INFO - 'SHLVL': '1', 20:22:36 INFO - 'TERM': 'linux', 20:22:36 INFO - 'TMOUT': '86400', 20:22:36 INFO - 'USER': 'cltbld', 20:22:36 INFO - 'XDG_SESSION_COOKIE': '745a4373a2a16df560f216e000000264-1465954094.342761-283144773', 20:22:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 20:22:36 INFO - '_': '/tools/buildbot/bin/python'} 20:22:36 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-032', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 20:22:36 INFO - mozversion application_buildid: 20160614173009 20:22:36 INFO - mozversion application_changeset: 071e9554e3e76a7692fd1a24b845bc42064352b0 20:22:36 INFO - mozversion application_display_name: Nightly 20:22:36 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 20:22:36 INFO - mozversion application_name: Firefox 20:22:36 INFO - mozversion application_remotingname: firefox 20:22:36 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 20:22:36 INFO - mozversion application_vendor: Mozilla 20:22:36 INFO - mozversion application_version: 50.0a1 20:22:36 INFO - mozversion platform_buildid: 20160614173009 20:22:36 INFO - mozversion platform_changeset: 071e9554e3e76a7692fd1a24b845bc42064352b0 20:22:36 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 20:22:36 INFO - mozversion platform_version: 50.0a1 20:22:36 INFO - using testdate: 1465960956 20:22:36 INFO - actual date: 1465960956 20:22:36 INFO - starting webserver on 'localhost:43115' 20:22:36 INFO - SUITE-START | Running 2 tests 20:22:36 INFO - TEST-START | dromaeo_css 20:22:36 INFO - operating with platform_type : linux_ 20:22:36 INFO - Initialising browser for dromaeo_css test... 20:22:36 INFO - TEST-INFO | started process 8966 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpDcWuFy/profile http://localhost:43115/getInfo.html) 20:22:42 INFO - PROCESS | 8966 | __metrics Screen width/height:1600/1200 20:22:42 INFO - PROCESS | 8966 | colorDepth:24 20:22:42 INFO - PROCESS | 8966 | Browser inner width/height: 1024/697 20:22:42 INFO - PROCESS | 8966 | __metrics 20:22:43 ERROR - PROCESS | 8966 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2947: TypeError: this.tabs is undefined 20:22:44 INFO - TEST-INFO | 8966: exit 0 20:22:44 INFO - Browser initialized. 20:22:44 INFO - Running cycle 1/1 for dromaeo_css test... 20:22:44 INFO - TEST-INFO | started process 9089 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpDcWuFy/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 20:22:56 INFO - PROCESS | 9089 | RSS: Main: 184791040 20:22:56 INFO - PROCESS | 9089 | 20:23:46 INFO - PROCESS | 9089 | 1465961026150 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] 20:25:54 INFO - PROCESS | 9089 | Cycle 1(1): loaded http://localhost:43115/tests/dromaeo/cssquery-dojo.html (next: http://localhost:43115/tests/dromaeo/cssquery-ext.html) 20:25:55 INFO - PROCESS | 9089 | RSS: Main: 187928576 20:25:55 INFO - PROCESS | 9089 | 20:28:56 INFO - PROCESS | 9089 | Cycle 1(1): loaded http://localhost:43115/tests/dromaeo/cssquery-ext.html (next: http://localhost:43115/tests/dromaeo/cssquery-jquery.html) 20:28:57 INFO - PROCESS | 9089 | RSS: Main: 187543552 20:28:57 INFO - PROCESS | 9089 | 20:31:59 INFO - PROCESS | 9089 | Cycle 1(1): loaded http://localhost:43115/tests/dromaeo/cssquery-jquery.html (next: http://localhost:43115/tests/dromaeo/cssquery-mootools.html) 20:31:59 INFO - PROCESS | 9089 | RSS: Main: 189145088 20:31:59 INFO - PROCESS | 9089 | 20:35:01 INFO - PROCESS | 9089 | Cycle 1(1): loaded http://localhost:43115/tests/dromaeo/cssquery-mootools.html (next: http://localhost:43115/tests/dromaeo/cssquery-prototype.html) 20:35:02 INFO - PROCESS | 9089 | RSS: Main: 186052608 20:35:02 INFO - PROCESS | 9089 | 20:38:04 INFO - PROCESS | 9089 | Cycle 1(1): loaded http://localhost:43115/tests/dromaeo/cssquery-prototype.html (next: http://localhost:43115/tests/dromaeo/cssquery-yui.html) 20:38:05 INFO - PROCESS | 9089 | RSS: Main: 188219392 20:38:05 INFO - PROCESS | 9089 | 20:41:07 INFO - PROCESS | 9089 | Cycle 1(1): loaded http://localhost:43115/tests/dromaeo/cssquery-yui.html (next: http://localhost:43115/tests/dromaeo/cssquery-dojo.html) 20:41:07 INFO - PROCESS | 9089 | RSS: Main: 189337600 20:41:07 INFO - PROCESS | 9089 | 20:41:07 INFO - PROCESS | 9089 | __start_tp_report 20:41:07 INFO - PROCESS | 9089 | _x_x_mozilla_page_load 20:41:07 INFO - PROCESS | 9089 | _x_x_mozilla_page_load_details 20:41:07 INFO - PROCESS | 9089 | |i|pagename|runs| 20:41:07 INFO - PROCESS | 9089 | |0;dojo.html;3054.633443986722;3109.7356724678402;3117.2830249042718;3147.8740850365984;3154.085315258575;5324.201369794528;5340.225667278242;5408.972955135224;5426.050441172799;5481.287432633762;5205.27126202332;5207.583393328534;5293.364796224459;5341.359036915565;5407.486288802567;4689.4841567427475;4696.835610753625;4789.640776941726;4840.080384726891;4874.561289483946;847.8750618422663;4764.428268607772;4836.709797412149;4868.513148685139;4888.755562221892;4904.509549045102;4907.582855457273;4927.852164435055;4947.777350019258;4951.504849515056;4955.479674634147;4966.478519755446;4975.825846095369;4985.651004429691;4990.326305948687;4734.976325118352;4749.810007599692;4785.138675038492;4788.04239152171;4791.089692958327;5192.117340052162;5255.1329030709885;5272.288241087443;5276.050310944029;5278.841634750926;5479.835604931858;5695.943040569624;5761.395053519362;5769.509591684712;5775.104858746901;5757.424257574251;5810.709464526799;5830.154627578977;5838.7080645967535;5882.617629854089;5430.945690543083;5432.320959880015;5435.402105768362;5440.183972404131;5440.292761940962;5643.379228284885;5813.709314534256;5822.243108395882;5919.378465261172;5919.67441790697;5656.8020119295625;5676.091825307931;5683.119116536944;5688.40271771458;5701.515371193412;5732.16883551891;5754.338251101093;5756.597038207369;5756.7121643917635;5757.453041961091;5520.447955204448;5626.1842032905815;5627.549796016309;5635.690037048002;5673.3475650299915;5712.0860662293835;5726.4273572642405;5737.168110623936;5746.798862039892;5747.109198074305;4385.298352263686;4387.692861499728;4412.0955204183065;4433.091216300651;4461.24158892989;3808.980955095207;3907.706921980806;3941.4876066111224;3986.22268657609;3987.9202415951518;5311.28297679816;5397.27136836522;5423.945760542423;5471.124620060851;5486.259354987105;5807.157962095473;5809.041508151107;5809.767609295581;5829.154772557956;5838.2702162229725;5364;5372.543333816591;5378.13949768043;5405.675659460445;5502.394736578973;4935.580475659609;4949.430815456269;4951.7276549789385;4953.455119936804;4974.950250497521;5858.53131749459;5859.560532960045;5867.765289388377;5870.354261031283;5876.236089308362;5603.075492543685;5613.663180209201;5660.88678226425;5660.9150862737915;5677.914831277451;5843.181954526284;5849.532037436909;5858.794942177004;5863;5864.618799778001;5584.525315348241;5609.495145436767;5613.803516876889;5633.915491267552;5634.577406694596;5721.256236689203;5741.110127930177;5765.682887441231;5814.76740930358;5830.125481177857;5546.916796248141;5590.077637189818;5598.692071936082;5638.407967163553;5642;5404.945950540444;5445.074337362578;5574.609777315549;5642.802501912413;5647.068233741386;5368.543673787615;5425.728713564385;5445.128779395278;5449.427810079885;5523.1991361253195;5486.835394938158;5543.8891222174525;5578.77684892616;5584.385717570983;5586.078297080936;5365.65123267002;5487.259220005249;5489.862753431036;5490.286262785812;5522.475364840334 20:41:07 INFO - PROCESS | 9089 | |1;ext.html;571.7284289962269;597.9402059794019;605.382509839963;617.1822335405589;636.141209367354;42122.789386053104;43782.56217437825;43925.34111988319;43981.34027989575;47955.76022119893;45060.77469612656;45580;45649.31526027112;45684;45884;8927.28581713463;9025.593848276843;9033.141851524128;9041.95479022604;9074.410163339395;8767.123287671246;8804.471731696087;8847.071057538962;8893.822123557526;8919.955400223022;8890.644374225023;8964;8976.551172441385;9001.95499022504;9009.369344145913;8810.955945220298;8826.691065812665;8867.290616750677;8890.59992300348;8943.910560894374;8929.374943753939;8972.147645973622;9004.099590041009;9016.188543031092;9018.909810901938;42787.57212427867;42840.357394639104;43051.35422968658;43115.78442107801;43280.56719432797;3785.8107094645156;3854.8843534694006;3867.6325749053794;4194.412782210493;4337.609615134653;31942.680573194204;32705.836470817492;32801.343973120405;33088.66911330904;34095.488567671506;4346.391505189276;4468.084042771224;4485.388806339773;4510.774461276956;4522.072975040109;346711;349777.99999999744;350239;352395;354348;58336.12495812566;58705.119423208685;58727;58731.119033214534;58732;37199.81400092982;37628;37936;40643.390349144785;61937.38062619316;14849;15024;15031.549053528412;15063.774043389358;15078.396864125312;10945.124390048777;11008.39453830031;11127.165462590337;11128.109751219883;11142.108631309477;19694.424446044282;19834.107465164103;19902.303419380252;19929.10319035647;20069.39791806248;7228.891566626505;7312.1591017033725;7373.483856130019;7429.925700742923;7490;987.8024395121005;992.6277645882794;1015.4871789746131;1124.6963319903743;1129.7232178116415;31440.52839207414;31514.842425787723;31811.522827157147;31960;32233.838830806166;1101.8292164714483;1172.472387425662;1189.8810118988206;1215.7568486302775;1220.1824777399163;16844.91577542129;16863.15684215809;16906.74639880403;16988.49034528966;17239.05185214825;532419;544472;544643;551559;551644;60225.69887150536;60468.09297860535;60834.39165608287;60852.391476085555;61107.694461527404;1215.5502464088167;1251.7246205834701;1289.8968082553374;1344.0927374022497;1350.3113412159673;30690;31122.844385777928;31453.02392545409;31654.208644784063;32342.029739107864;51218.74390628023;51700.74149629228;52092.73953630208;52144;52525;491342;494520.6917757861;495710;497338;499152;29093;29108.417831643674;29131;29207;29269;48547;49098.26352604642;49867.50132498628;49941.500584993686;50446.24330635117;39771;41720;42110.36834447424;42685.78657106694;42867.57132428636;41558.1688366237;41771.91799635477;42127.1574568513;42235.577644223165;42329.78835105805;36182.638173617925;40222.1955560893;40317.59682403256;40988;41123.58876411198;35197.82401088081;35899.641003590674;36702.63297366992;37096;37736;28301.433971320046;28844.278893027844;28870.133895983156;29015.564766528096;29141.7085829139 20:41:07 INFO - PROCESS | 9089 | |2;jquery.html;396.181884408696;405.1128029615141;408.18974335943165;408.5607971430712;419.00904361185803;18030.18864151113;19262.51843703908;19716.70424943625;19765.110570024346;20444.28445004425;18676.53308667284;18983.33558325459;19511.804881951175;19675.803241967576;19686.310979115733;5600.215969764236;5651.660900345993;5651.745671444774;5714;5729.28383952006;5572.637778544402;5609.298837645294;5644.520215781664;5648.717564121798;5680.4319568043275;5554.50009499145;5619.297587801525;5653.180288858113;5659.320881494205;5669.659820410789;5600.915986260209;5602.887942241153;5620.5503559715125;5626.859328516799;5640.351359593617;4930.80276788928;4976.253561965698;5002.52476014778;5038.622103342227;5042.823501177478;21934.780652193433;22181;22886.313410597708;23028.884855575616;23130.42173945648;2108.230495869012;2253.9323820285417;2328.092044102801;2423.454722687381;2484.6148846928754;10346.224033197464;10488.05607495329;10493.580256789719;10507.579696812118;10715.892841071567;1910.379126783787;1987.7515310586177;1999.9400017999483;2010.4370776182693;2010.6079314533672;79215;81992;83555.99999999939;84477;85587.5720621393;11198.104151667847;11205.831912521318;11334.546618135182;11394.544218231178;11429.59996400122;15381.15426148847;15694.9215253923;15747.13390763519;15764.290606922716;15786.526404207892;7254.419646428273;7280.890786638205;7581.962090189514;7771.406861593473;7839.137694853562;6827.761028363983;7012.544184627983;7017.806972814634;7120.2167761547225;7256.201817800038;4791.688540244873;4800.303955926371;4834.154023045953;4844.709317440965;4896.877578060506;1968.3307675390436;2007.829334506554;2040.734704488407;2055.290924631;2061.3300677279944;943.297243553557;963.1957315641517;969.3360048366891;984.3601658921615;1064.7178497698117;19056.333028343943;19421.611567768567;19469.318573849847;19556.511087222934;19713.605727885362;980.3921568627496;1007.3452256033637;1022.9283950123569;1034.1416624201895;1039.4542864995938;10333.94833025845;11012.669619911416;11095.611653592085;11145.2198346115;11200.159988000933;414730;420810;421255;422089;429318;93848;94304;96855.51572242235;98277;100347;970.4371464550544;972.3971137894409;1023.3501726403639;1044;1050.2333296693457;17446.389376371768;17515.737263941304;17518.824811751718;17563.297468101642;17837.73243401324;30543.2364190897;33043.66956330406;41940.07846272996;44724.55275447204;44931.55068449274;53269;54599;56977;59540.70229648824;64532;8886.422382545114;9028;9118.498482583522;9183.54082295896;9306.395084319498;6622.437092847162;9664.371815831948;14199.64500887486;14335;14342.569722908329;11372.20394572372;11729.296242225493;12137.21108127969;12215.816762748389;12570.245785252913;12283.385830708608;12326.50693972231;12416.627501174979;12508.812367814307;12536.498540058661;12035;12486.687832804253;12535.686607834512;12580.685482863002;12720.236785792882;8931;8989.82020359576;9016.143466370684;9096.818063638559;9117.680881169392;9372.062793720574;12133.75732485363;12162.270263784201;12466.127371083938;12743.362831858556 20:41:07 INFO - PROCESS | 9089 | |3;mootools.html;1457.3587621446563;1498.1310839712967;1589.276879020046;1758.6570618729345;1779.4394765648813;7614.086309642837;8712.215900568948;8716.215540601344;9393.436393816375;9395.859062114074;8748.518831464267;9033.548322583878;9047.502387368691;9093.13615206556;9169.358144929842;2334.789868911802;2376.370261880603;2394.0423830467867;2398.7121545414575;2407.037185125946;2328.2316835444262;2348.8842799670106;2375.726791418983;2410.590199666061;2423.079229892647;2371.6561098640686;2378.8096952243777;2381.678473406094;2410.2287268074138;2415.118481754165;2322.976770232293;2331.603627383349;2348.1311914591624;2350.9177178798745;2386.331827088418;2332.9650055249185;2335.065973610552;2335.2760644200184;2337.1118974789642;2349.682792822964;9099.272058235325;9236.79921610193;9247.861282080774;9253.6298548058;9277.396969197049;5204.271402003723;5270.841874743764;5288.338957630296;5318.601104917108;5325.1479763238085;3485.8257087145794;3503.632118627558;3539.876104336336;3604.1350075981577;3613.8735144270086;1208.9758204835941;1223.743013967068;1226.6136167107422;1236.369451579692;1266.1580049267227;12928.48286068556;12953.805692914613;13003.219806811527;13036.478540858354;13080.476780928751;4688.2733176357715;4854.8786280342565;4933.235348520985;4934.3338649282605;4942.258661200849;10826.133909287395;10850.62022829213;10895.727606809893;10906.672799816019;10989.285696429706;5287.550558202519;5332.733363331896;5342.5993050521365;5369.087255166631;5382.869597384515;4256.91486170281;4759.809607615726;4763.499832517536;4885.096257192431;4915.754212289371;4093.283675356801;4125.43233571247;4127.669786417079;4159.688023398257;4214.1150358425075;1322.7883538633964;1327.2637525366256;1333.3466601365456;1342.6975833441545;1347.9730405391838;832.7834762961553;889.7553172877381;989.1147423056324;990.8860481044773;1003.7340104872214;5635.915461268084;5885.352611212763;5924.7333869975955;6014.609050411709;6070.969645151746;954.9278066595505;987.6839411388287;999.6850991937516;1015.0864222199931;1031.0359813574332;4027.617376349242;4032.8790136295956;4043.8584649537715;4047.5371165537417;4075.3275709508193;11293.265937714023;11760.94119529414;11772.587959421551;11807.23252988553;11839.704007399883;11541;11547.249428787101;11640.06879449642;11645.708857278636;11661.708457288636;8216.753497395088;8445.197706218023;8455.408121431563;8465.153484651608;8468.745937621881;5759.964849035488;5797.710114494343;5942.435468630473;6038.909416358846;6154.046122850965;9738.610455581698;10505.527251273557;10530.262881598215;10608.575656973944;10696.89303106959;10205.285630005828;10433.426161561187;10454.372737635766;10496.947515262375;10600.787984240425;7288;7452.3665488431925;7613.733519326797;7989.7203597873795;8174.959125204336;8271.296939760188;8314.002319721672;8316.126806685454;8320.126386729306;8398;7541.585212813348;7716.652750626123;7807.492512986865;7889.211078892295;7922.841543169219;7361.668724907499;7512.8873066905135;7513.661885215288;7597.772066838003;7619.428542859197;7102.715891364288;7154;7174.174969878322;7187.712491500491;7190.96404517974;4859.927101093557;4870.4155501340065;5032.6225533084435;5062.569681577107;5103.132467480612;4870.95129048705;4907.975460122677;4913.828016019422;4954.157793175241;4966.701997880139 20:41:07 INFO - PROCESS | 9089 | |4;prototype.html;332.5195093090484;334.15792203646794;334.35636399930144;342.06786506769043;344.9913752156194;5529.502344788968;5655.858603534909;5664.263645726055;5671.432856714327;5674.531578763231;5552.583556233289;5553.972230138854;5564.276644036279;5571.8328450146455;5596.664200147994;4145.585441455853;4181.456410666609;4305.763183024932;4317.309230523117;4333.155034768221;4290.54949230331;4319.870403887872;4324.697271191002;4333.198358303708;4338.783060846945;4290.935635965463;4301.010767523471;4301.182775272704;4303.139372125572;4312.805923733424;4078.062045729484;4304.440422745039;4304.78476076195;4326.437563116775;4331.938675024639;3774.358359078963;3787.14789172434;3792.5259342582176;3796.791176485292;3812.5424949006297;5467.644603100825;5468.453154684539;5471.562275018029;5491.341039075297;5496.203050557647;4896.824762057081;4901.362822833009;4905.730184839832;4909.3126962225315;4961.3798275215595;5777.133429985493;5824.767009319622;5840.561957853178;5853.795117170878;5855.882882342329;4176.812043458051;4177.101923086551;4182.519010313792;4189.05746207104;4191.937120943188;5854.882902341929;6063.423974722395;6100.847478813065;6115.266168059861;6120.755169793203;4173.8956526087095;4225.767582782976;4228.534861165269;4229.978850105791;4245.150969806051;4247.87256382309;4258.936115958263;4274.337477690963;4274.978625106854;4278.187144442608;4773.451053128934;4839.395075615548;4857.222844344888;4858.902821943541;4901.215805471107;5846.853828654318;5857;5867.911981320283;5910.408959104141;5948.323254535477;1489.1586253766586;1492.4776328285013;1496.9596130689067;1498.0412535976984;1502.1587910770004;916.5692124701379;934.3179478980383;934.9995504809788;936.1995493852794;937.7702462896634;5055.873603159876;5064.860406408528;5080.034793389318;5104.464031276737;5114.442778610694;5362.91955620666;5382.730863456812;5383.415960338981;5408.107662235687;5462.426445223274;5099.898002039939;5138.820141295037;5338.572914166935;5772.336181339116;5791.189233507313;3241.3193229422086;3264.6245681746905;3264.8041117533025;3271.362084393568;3276.737860971117;6010.767792602506;6248.219257511678;6319.431251187415;6338.714757835908;6355.682215889187;6173.3146081454715;6192.566520343533;6192.752289908443;6197.163382943245;6203.193584833943;6189.659568723673;6201.348858369806;6220.191375121205;6226.719797609118;6246.875062498815;5810.215620891126;6070.271567411763;6084.787032453843;6106.969465152646;6118.694065296806;6010.218671572842;6019.578629495893;6022.187004754477;6036.607620504653;6045.667488288186;6023.30731965812;6223.439890409703;6230.6884655766125;6275.937240627718;6292.622442653455;4305.763183024964;4326.567343265649;4327.350897365421;4330.8306757176015;4344.5221025686515;5779.248697669276;5881.853038657421;5922.7927022554;5928.673922934107;6096.719688865388;5827.155062515996;5849;5855.443732845373;5855.707214639166;5919.171316015675;5871.4715675589405;5872.735726892385;5881.32364778056;5894.2926848778425;5907.675077870758;5541.5843811715085;5880.706244626175;5896.351401345934;5904.468597826216;5907.202527658883;5863.882722345615;5897.5281977440845;5924.407559244041;6012.549058820518;6019.608725432833;5654.953833540643;5680.204771331934;5786.07422812348;5801.767929282782;5831.94168058314 20:41:07 INFO - PROCESS | 9089 | |5;yui.html;738.2138023005502;752.4131177681404;758.909749262171;786.4259090863671;802.1497212954267;14714.190719510423;14917.179555124463;14986;14989.775153372708;14994.250287485624;14728.852711472882;14745.77881331781;14812;14817.11097334158;14819.333130009149;646.3439608797074;766.2414209932183;767.6890859202032;782.2138750555683;782.949108307961;777.5334799120511;778.6418247606108;779.6218833865571;782.0576205672152;784.1609477858693;831.3141658132065;831.6673330667751;832.8584140696066;835.2357592802579;835.678263868409;825.9463134896242;831.0733532111682;831.7463173732009;834.0075310380658;834.8497270491309;603.3303033632665;605.9606125601866;606.9908951365733;608.1880689279817;608.7747533412621;14771.926140369336;14797.334119964627;14807.70384592313;14833.110013399122;14883.18142502162;12589.244645321218;12653.430595623218;15289.923550382287;15569.532914012598;15787.921060394625;13122.671933201651;13202.867971320356;13300.86699133006;13520.864791352158;13574.932125339408;4515.119551687422;4546.795394207269;4572.154151481986;4607.723536587815;4612.607928326096;75856.24143758547;77298.61350693267;79393.20606793916;80273.59863200647;81323.5933820327;11008.284461510137;11182;11280.661580152608;11305.26515776472;11348.205625606293;20208.19167233294;20211.595768084557;20252.392428227176;20277.391678249674;20287.18851245963;8094.15011423792;8097.149799271109;8172.42793004484;8228.588570571448;8257.21556452136;4406.166635027546;4462.48681401643;4465.37484752135;4465.754383508874;4575.679702420799;3420.452727563578;3523.224890524081;3531.805750683686;3538.7699799513466;3549.2723991581665;584.8187062010705;588.9558283128782;604.157200705014;613.929398119213;615.3446579392933;669.3473862983552;695.6730336741723;700.1807884774826;707.5224223649119;709.386380780621;8680.522571258514;8681.262092722189;9422.776911076335;9506.47714375716;9628.807423851484;630.9936900631027;639.5555089212952;640.2029473305671;675.2504719761159;686.1628812848317;4436.157130145262;4539.909201815945;4607.976960115245;4622.838200662961;4645.953540464552;89146;104166.4791676052;104433;105159.47420263002;105446.47276763567;87981.12018879729;89359.55320223357;89385.55307223552;89841.55079224562;91205.54397227972;85258.58965641429;85432;85877;88819.55590222137;89525;8306.70926517569;8349.290310323448;8394.58027098655;8490.278326342082;8580.14198580137;51870.74064629653;52543;52557.73721131523;53904.46095538994;54583;65529.412941093666;74261;76001.61999189969;76874.61562692151;78584.21415785768;10699.625513107005;10977.28647637901;10985.285956412808;11194.216404851582;11247.775044499227;11066.39134847591;11347.886521135013;11737.706557336134;11899.107566932687;12232.449539770909;11669.88330116688;11672.474738636613;11727.237729547553;11780.587679431179;12296.139270251355;11137.665870023913;11306.84390406503;11354.772904542027;11399.658010259705;11921;11639.6508104757;11763;11912.463939122586;11925;12083.57707480234;8862.778430539289;9170.761947137318;9192.448453092837;9256.57826002611;9423.19902808269;9251.814963700823;9359.766005849908;9373.343865929592;9399.483028433227;9407.529623518934 20:41:07 INFO - PROCESS | 9089 | __end_tp_report 20:41:07 INFO - PROCESS | 9089 | __start_cc_report 20:41:07 INFO - PROCESS | 9089 | _x_x_mozilla_cycle_collect,364 20:41:07 INFO - PROCESS | 9089 | __end_cc_report 20:41:07 INFO - PROCESS | 9089 | __startTimestamp1465962067916__endTimestamp 20:41:07 INFO - PROCESS | 9089 | 20:41:07 INFO - PROCESS | 9089 | ------- Summary: start ------- 20:41:07 INFO - PROCESS | 9089 | Number of tests: 6 20:41:07 INFO - PROCESS | 9089 | 20:41:07 INFO - PROCESS | 9089 | [#0] dojo.html Cycles:165 Average:5285.49 Median:5487.26 stddev:688.90 (12.6%) stddev-sans-first:668.41 20:41:07 INFO - PROCESS | 9089 | Values: 3054.6 3109.7 3117.3 3147.9 3154.1 5324.2 5340.2 5409.0 5426.1 5481.3 5205.3 5207.6 5293.4 5341.4 5407.5 4689.5 4696.8 4789.6 4840.1 4874.6 847.9 4764.4 4836.7 4868.5 4888.8 4904.5 4907.6 4927.9 4947.8 4951.5 4955.5 4966.5 4975.8 4985.7 4990.3 4735.0 4749.8 4785.1 4788.0 4791.1 5192.1 5255.1 5272.3 5276.1 5278.8 5479.8 5695.9 5761.4 5769.5 5775.1 5757.4 5810.7 5830.2 5838.7 5882.6 5430.9 5432.3 5435.4 5440.2 5440.3 5643.4 5813.7 5822.2 5919.4 5919.7 5656.8 5676.1 5683.1 5688.4 5701.5 5732.2 5754.3 5756.6 5756.7 5757.5 5520.4 5626.2 5627.5 5635.7 5673.3 5712.1 5726.4 5737.2 5746.8 5747.1 4385.3 4387.7 4412.1 4433.1 4461.2 3809.0 3907.7 3941.5 3986.2 3987.9 5311.3 5397.3 5423.9 5471.1 5486.3 5807.2 5809.0 5809.8 5829.2 5838.3 5364.0 5372.5 5378.1 5405.7 5502.4 4935.6 4949.4 4951.7 4953.5 4975.0 5858.5 5859.6 5867.8 5870.4 5876.2 5603.1 5613.7 5660.9 5660.9 5677.9 5843.2 5849.5 5858.8 5863.0 5864.6 5584.5 5609.5 5613.8 5633.9 5634.6 5721.3 5741.1 5765.7 5814.8 5830.1 5546.9 5590.1 5598.7 5638.4 5642.0 5404.9 5445.1 5574.6 5642.8 5647.1 5368.5 5425.7 5445.1 5449.4 5523.2 5486.8 5543.9 5578.8 5584.4 5586.1 5365.7 5487.3 5489.9 5490.3 5522.5 20:41:07 INFO - PROCESS | 9089 | 20:41:07 INFO - PROCESS | 9089 | [#1] ext.html Cycles:180 Average:61944.80 Median:42736.68 stddev:125110.26 (292.7%) stddev-sans-first:125376.37 20:41:07 INFO - PROCESS | 9089 | Values: 571.7 597.9 605.4 617.2 636.1 42122.8 43782.6 43925.3 43981.3 47955.8 45060.8 45580.0 45649.3 45684.0 45884.0 8927.3 9025.6 9033.1 9042.0 9074.4 8767.1 8804.5 8847.1 8893.8 8920.0 8890.6 8964.0 8976.6 9002.0 9009.4 8811.0 8826.7 8867.3 8890.6 8943.9 8929.4 8972.1 9004.1 9016.2 9018.9 42787.6 42840.4 43051.4 43115.8 43280.6 3785.8 3854.9 3867.6 4194.4 4337.6 31942.7 32705.8 32801.3 33088.7 34095.5 4346.4 4468.1 4485.4 4510.8 4522.1 346711.0 349778.0 350239.0 352395.0 354348.0 58336.1 58705.1 58727.0 58731.1 58732.0 37199.8 37628.0 37936.0 40643.4 61937.4 14849.0 15024.0 15031.5 15063.8 15078.4 10945.1 11008.4 11127.2 11128.1 11142.1 19694.4 19834.1 19902.3 19929.1 20069.4 7228.9 7312.2 7373.5 7429.9 7490.0 987.8 992.6 1015.5 1124.7 1129.7 31440.5 31514.8 31811.5 31960.0 32233.8 1101.8 1172.5 1189.9 1215.8 1220.2 16844.9 16863.2 16906.7 16988.5 17239.1 532419.0 544472.0 544643.0 551559.0 551644.0 60225.7 60468.1 60834.4 60852.4 61107.7 1215.6 1251.7 1289.9 1344.1 1350.3 30690.0 31122.8 31453.0 31654.2 32342.0 51218.7 51700.7 52092.7 52144.0 52525.0 491342.0 494520.7 495710.0 497338.0 499152.0 29093.0 29108.4 29131.0 29207.0 29269.0 48547.0 49098.3 49867.5 49941.5 50446.2 39771.0 41720.0 42110.4 42685.8 42867.6 41558.2 41771.9 42127.2 42235.6 42329.8 36182.6 40222.2 40317.6 40988.0 41123.6 35197.8 35899.6 36702.6 37096.0 37736.0 28301.4 28844.3 28870.1 29015.6 29141.7 20:41:07 INFO - PROCESS | 9089 | 20:41:07 INFO - PROCESS | 9089 | [#2] jquery.html Cycles:180 Average:27232.50 Median:16513.93 stddev:70122.15 (424.6%) stddev-sans-first:70289.91 20:41:07 INFO - PROCESS | 9089 | Values: 396.2 405.1 408.2 408.6 419.0 18030.2 19262.5 19716.7 19765.1 20444.3 18676.5 18983.3 19511.8 19675.8 19686.3 5600.2 5651.7 5651.7 5714.0 5729.3 5572.6 5609.3 5644.5 5648.7 5680.4 5554.5 5619.3 5653.2 5659.3 5669.7 5600.9 5602.9 5620.6 5626.9 5640.4 4930.8 4976.3 5002.5 5038.6 5042.8 21934.8 22181.0 22886.3 23028.9 23130.4 2108.2 2253.9 2328.1 2423.5 2484.6 10346.2 10488.1 10493.6 10507.6 10715.9 1910.4 1987.8 1999.9 2010.4 2010.6 79215.0 81992.0 83556.0 84477.0 85587.6 11198.1 11205.8 11334.5 11394.5 11429.6 15381.2 15694.9 15747.1 15764.3 15786.5 7254.4 7280.9 7582.0 7771.4 7839.1 6827.8 7012.5 7017.8 7120.2 7256.2 4791.7 4800.3 4834.2 4844.7 4896.9 1968.3 2007.8 2040.7 2055.3 2061.3 943.3 963.2 969.3 984.4 1064.7 19056.3 19421.6 19469.3 19556.5 19713.6 980.4 1007.3 1022.9 1034.1 1039.5 10333.9 11012.7 11095.6 11145.2 11200.2 414730.0 420810.0 421255.0 422089.0 429318.0 93848.0 94304.0 96855.5 98277.0 100347.0 970.4 972.4 1023.4 1044.0 1050.2 17446.4 17515.7 17518.8 17563.3 17837.7 30543.2 33043.7 41940.1 44724.6 44931.6 53269.0 54599.0 56977.0 59540.7 64532.0 8886.4 9028.0 9118.5 9183.5 9306.4 6622.4 9664.4 14199.6 14335.0 14342.6 11372.2 11729.3 12137.2 12215.8 12570.2 12283.4 12326.5 12416.6 12508.8 12536.5 12035.0 12486.7 12535.7 12580.7 12720.2 8931.0 8989.8 9016.1 9096.8 9117.7 9372.1 12133.8 12162.3 12466.1 12743.4 20:41:07 INFO - PROCESS | 9089 | 20:41:07 INFO - PROCESS | 9089 | [#3] mootools.html Cycles:180 Average:5933.83 Median:4809.19 stddev:3443.61 (71.6%) stddev-sans-first:3436.84 20:41:07 INFO - PROCESS | 9089 | Values: 1457.4 1498.1 1589.3 1758.7 1779.4 7614.1 8712.2 8716.2 9393.4 9395.9 8748.5 9033.5 9047.5 9093.1 9169.4 2334.8 2376.4 2394.0 2398.7 2407.0 2328.2 2348.9 2375.7 2410.6 2423.1 2371.7 2378.8 2381.7 2410.2 2415.1 2323.0 2331.6 2348.1 2350.9 2386.3 2333.0 2335.1 2335.3 2337.1 2349.7 9099.3 9236.8 9247.9 9253.6 9277.4 5204.3 5270.8 5288.3 5318.6 5325.1 3485.8 3503.6 3539.9 3604.1 3613.9 1209.0 1223.7 1226.6 1236.4 1266.2 12928.5 12953.8 13003.2 13036.5 13080.5 4688.3 4854.9 4933.2 4934.3 4942.3 10826.1 10850.6 10895.7 10906.7 10989.3 5287.6 5332.7 5342.6 5369.1 5382.9 4256.9 4759.8 4763.5 4885.1 4915.8 4093.3 4125.4 4127.7 4159.7 4214.1 1322.8 1327.3 1333.3 1342.7 1348.0 832.8 889.8 989.1 990.9 1003.7 5635.9 5885.4 5924.7 6014.6 6071.0 954.9 987.7 999.7 1015.1 1031.0 4027.6 4032.9 4043.9 4047.5 4075.3 11293.3 11760.9 11772.6 11807.2 11839.7 11541.0 11547.2 11640.1 11645.7 11661.7 8216.8 8445.2 8455.4 8465.2 8468.7 5760.0 5797.7 5942.4 6038.9 6154.0 9738.6 10505.5 10530.3 10608.6 10696.9 10205.3 10433.4 10454.4 10496.9 10600.8 7288.0 7452.4 7613.7 7989.7 8175.0 8271.3 8314.0 8316.1 8320.1 8398.0 7541.6 7716.7 7807.5 7889.2 7922.8 7361.7 7512.9 7513.7 7597.8 7619.4 7102.7 7154.0 7174.2 7187.7 7191.0 4859.9 4870.4 5032.6 5062.6 5103.1 4871.0 4908.0 4913.8 4954.2 4966.7 20:41:07 INFO - PROCESS | 9089 | 20:41:07 INFO - PROCESS | 9089 | [#4] prototype.html Cycles:180 Average:4895.06 Median:5553.28 stddev:1453.67 (26.2%) stddev-sans-first:1416.84 20:41:07 INFO - PROCESS | 9089 | Values: 332.5 334.2 334.4 342.1 345.0 5529.5 5655.9 5664.3 5671.4 5674.5 5552.6 5554.0 5564.3 5571.8 5596.7 4145.6 4181.5 4305.8 4317.3 4333.2 4290.5 4319.9 4324.7 4333.2 4338.8 4290.9 4301.0 4301.2 4303.1 4312.8 4078.1 4304.4 4304.8 4326.4 4331.9 3774.4 3787.1 3792.5 3796.8 3812.5 5467.6 5468.5 5471.6 5491.3 5496.2 4896.8 4901.4 4905.7 4909.3 4961.4 5777.1 5824.8 5840.6 5853.8 5855.9 4176.8 4177.1 4182.5 4189.1 4191.9 5854.9 6063.4 6100.8 6115.3 6120.8 4173.9 4225.8 4228.5 4230.0 4245.2 4247.9 4258.9 4274.3 4275.0 4278.2 4773.5 4839.4 4857.2 4858.9 4901.2 5846.9 5857.0 5867.9 5910.4 5948.3 1489.2 1492.5 1497.0 1498.0 1502.2 916.6 934.3 935.0 936.2 937.8 5055.9 5064.9 5080.0 5104.5 5114.4 5362.9 5382.7 5383.4 5408.1 5462.4 5099.9 5138.8 5338.6 5772.3 5791.2 3241.3 3264.6 3264.8 3271.4 3276.7 6010.8 6248.2 6319.4 6338.7 6355.7 6173.3 6192.6 6192.8 6197.2 6203.2 6189.7 6201.3 6220.2 6226.7 6246.9 5810.2 6070.3 6084.8 6107.0 6118.7 6010.2 6019.6 6022.2 6036.6 6045.7 6023.3 6223.4 6230.7 6275.9 6292.6 4305.8 4326.6 4327.4 4330.8 4344.5 5779.2 5881.9 5922.8 5928.7 6096.7 5827.2 5849.0 5855.4 5855.7 5919.2 5871.5 5872.7 5881.3 5894.3 5907.7 5541.6 5880.7 5896.4 5904.5 5907.2 5863.9 5897.5 5924.4 6012.5 6019.6 5655.0 5680.2 5786.1 5801.8 5831.9 20:41:07 INFO - PROCESS | 9089 | 20:41:07 INFO - PROCESS | 9089 | [#5] yui.html Cycles:180 Average:19829.44 Median:596.14 stddev:28514.74 (4783.2%) stddev-sans-first:28558.70 20:41:07 INFO - PROCESS | 9089 | Values: 738.2 752.4 758.9 786.4 802.1 14714.2 14917.2 14986.0 14989.8 14994.3 14728.9 14745.8 14812.0 14817.1 14819.3 646.3 766.2 767.7 782.2 782.9 777.5 778.6 779.6 782.1 784.2 831.3 831.7 832.9 835.2 835.7 825.9 831.1 831.7 834.0 834.8 603.3 606.0 607.0 608.2 608.8 14771.9 14797.3 14807.7 14833.1 14883.2 12589.2 12653.4 15289.9 15569.5 15787.9 13122.7 13202.9 13300.9 13520.9 13574.9 4515.1 4546.8 4572.2 4607.7 4612.6 75856.2 77298.6 79393.2 80273.6 81323.6 11008.3 11182.0 11280.7 11305.3 11348.2 20208.2 20211.6 20252.4 20277.4 20287.2 8094.2 8097.1 8172.4 8228.6 8257.2 4406.2 4462.5 4465.4 4465.8 4575.7 3420.5 3523.2 3531.8 3538.8 3549.3 584.8 589.0 604.2 613.9 615.3 669.3 695.7 700.2 707.5 709.4 8680.5 8681.3 9422.8 9506.5 9628.8 631.0 639.6 640.2 675.3 686.2 4436.2 4539.9 4608.0 4622.8 4646.0 89146.0 104166.5 104433.0 105159.5 105446.5 87981.1 89359.6 89385.6 89841.6 91205.5 85258.6 85432.0 85877.0 88819.6 89525.0 8306.7 8349.3 8394.6 8490.3 8580.1 51870.7 52543.0 52557.7 53904.5 54583.0 65529.4 74261.0 76001.6 76874.6 78584.2 10699.6 10977.3 10985.3 11194.2 11247.8 11066.4 11347.9 11737.7 11899.1 12232.4 11669.9 11672.5 11727.2 11780.6 12296.1 11137.7 11306.8 11354.8 11399.7 11921.0 11639.7 11763.0 11912.5 11925.0 12083.6 8862.8 9170.8 9192.4 9256.6 9423.2 9251.8 9359.8 9373.3 9399.5 9407.5 20:41:07 INFO - PROCESS | 9089 | -------- Summary: end -------- 20:41:07 INFO - PROCESS | 9089 | 20:41:08 INFO - TEST-INFO | 9089: exit 0 20:41:08 INFO - TEST-OK | dromaeo_css | took 1111780ms 20:41:08 INFO - TEST-START | kraken 20:41:08 INFO - operating with platform_type : linux_ 20:41:08 INFO - Initialising browser for kraken test... 20:41:08 INFO - TEST-INFO | started process 9326 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpS5wcji/profile http://localhost:43115/getInfo.html) 20:41:14 INFO - PROCESS | 9326 | __metrics Screen width/height:1600/1200 20:41:14 INFO - PROCESS | 9326 | colorDepth:24 20:41:14 INFO - PROCESS | 9326 | Browser inner width/height: 1024/697 20:41:14 INFO - PROCESS | 9326 | __metrics 20:41:14 ERROR - PROCESS | 9326 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2947: TypeError: this.tabs is undefined 20:41:15 INFO - TEST-INFO | 9326: exit 0 20:41:15 INFO - Browser initialized. 20:41:15 INFO - Running cycle 1/1 for kraken test... 20:41:15 INFO - TEST-INFO | started process 9444 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpS5wcji/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 20:41:27 INFO - PROCESS | 9444 | RSS: Main: 185229312 20:41:27 INFO - PROCESS | 9444 | 20:41:30 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:43115/tests/kraken/driver.html?testName=audio-beat-detection) 20:41:31 INFO - PROCESS | 9444 | RSS: Main: 191369216 20:41:31 INFO - PROCESS | 9444 | 20:41:33 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:43115/tests/kraken/driver.html?testName=audio-dft) 20:41:34 INFO - PROCESS | 9444 | RSS: Main: 189911040 20:41:34 INFO - PROCESS | 9444 | 20:41:37 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:43115/tests/kraken/driver.html?testName=audio-fft) 20:41:37 INFO - PROCESS | 9444 | RSS: Main: 185171968 20:41:37 INFO - PROCESS | 9444 | 20:41:40 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:43115/tests/kraken/driver.html?testName=audio-oscillator) 20:41:40 INFO - PROCESS | 9444 | RSS: Main: 186187776 20:41:40 INFO - PROCESS | 9444 | 20:41:42 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:43115/tests/kraken/driver.html?testName=imaging-gaussian-blur) 20:41:43 INFO - PROCESS | 9444 | RSS: Main: 186318848 20:41:43 INFO - PROCESS | 9444 | 20:41:46 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:43115/tests/kraken/driver.html?testName=imaging-darkroom) 20:41:47 INFO - PROCESS | 9444 | RSS: Main: 186683392 20:41:47 INFO - PROCESS | 9444 | 20:41:50 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:43115/tests/kraken/driver.html?testName=imaging-desaturate) 20:41:51 INFO - PROCESS | 9444 | RSS: Main: 184066048 20:41:51 INFO - PROCESS | 9444 | 20:41:54 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:43115/tests/kraken/driver.html?testName=json-parse-financial) 20:41:54 INFO - PROCESS | 9444 | RSS: Main: 185413632 20:41:54 INFO - PROCESS | 9444 | 20:41:56 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:43115/tests/kraken/driver.html?testName=json-stringify-tinderbox) 20:41:57 INFO - PROCESS | 9444 | RSS: Main: 185896960 20:41:57 INFO - PROCESS | 9444 | 20:41:58 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:43115/tests/kraken/driver.html?testName=stanford-crypto-aes) 20:41:59 INFO - PROCESS | 9444 | RSS: Main: 186056704 20:41:59 INFO - PROCESS | 9444 | 20:42:01 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:43115/tests/kraken/driver.html?testName=stanford-crypto-ccm) 20:42:02 INFO - PROCESS | 9444 | RSS: Main: 186343424 20:42:02 INFO - PROCESS | 9444 | 20:42:04 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:43115/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 20:42:05 INFO - PROCESS | 9444 | RSS: Main: 186617856 20:42:05 INFO - PROCESS | 9444 | 20:42:08 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:43115/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 20:42:08 INFO - PROCESS | 9444 | RSS: Main: 186974208 20:42:08 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | Cycle 1(1): loaded http://localhost:43115/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:43115/tests/kraken/driver.html?testName=ai-astar) 20:42:10 INFO - PROCESS | 9444 | RSS: Main: 188116992 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | __start_tp_report 20:42:10 INFO - PROCESS | 9444 | _x_x_mozilla_page_load 20:42:10 INFO - PROCESS | 9444 | _x_x_mozilla_page_load_details 20:42:10 INFO - PROCESS | 9444 | |i|pagename|runs| 20:42:10 INFO - PROCESS | 9444 | |0;ai-astar;113;108;113;111;111;113;112;113;113;114 20:42:10 INFO - PROCESS | 9444 | |1;audio-beat-detection;149;125;153;186;126;160;149;134;180;133 20:42:10 INFO - PROCESS | 9444 | |2;audio-dft;163;162;161;164;167;172;162;165;164;168 20:42:10 INFO - PROCESS | 9444 | |3;audio-fft;76;77;77;168;76;77;77;75;160;76 20:42:10 INFO - PROCESS | 9444 | |4;audio-oscillator;85;85;145;85;86;86;148;86;86;139 20:42:10 INFO - PROCESS | 9444 | |5;imaging-gaussian-blur;117;118;119;118;117;118;118;118;118;117 20:42:10 INFO - PROCESS | 9444 | |6;imaging-darkroom;147;147;148;147;148;148;149;147;147;147 20:42:10 INFO - PROCESS | 9444 | |7;imaging-desaturate;97;96;96;96;96;95;96;97;97;95 20:42:10 INFO - PROCESS | 9444 | |8;json-parse-financial;54;53;54;53;52;56;53;55;55;55 20:42:10 INFO - PROCESS | 9444 | |9;json-stringify-tinderbox;60;63;60;60;61;60;60;60;60;60 20:42:10 INFO - PROCESS | 9444 | |10;stanford-crypto-aes;80;79;84;81;80;81;80;82;109;80 20:42:10 INFO - PROCESS | 9444 | |11;stanford-crypto-ccm;126;122;127;120;121;122;133;134;135;131 20:42:10 INFO - PROCESS | 9444 | |12;stanford-crypto-pbkdf2;160;167;157;160;167;161;164;161;164;161 20:42:10 INFO - PROCESS | 9444 | |13;stanford-crypto-sha256-iterative;64;66;65;64;64;68;64;64;64;63 20:42:10 INFO - PROCESS | 9444 | __end_tp_report 20:42:10 INFO - PROCESS | 9444 | __start_cc_report 20:42:10 INFO - PROCESS | 9444 | _x_x_mozilla_cycle_collect,908 20:42:10 INFO - PROCESS | 9444 | __end_cc_report 20:42:10 INFO - PROCESS | 9444 | __startTimestamp1465962130743__endTimestamp 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | ------- Summary: start ------- 20:42:10 INFO - PROCESS | 9444 | Number of tests: 14 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#0] ai-astar Cycles:10 Average:112.10 Median:113.00 stddev:1.73 (1.5%) stddev-sans-first:1.80 20:42:10 INFO - PROCESS | 9444 | Values: 113.0 108.0 113.0 111.0 111.0 113.0 112.0 113.0 113.0 114.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#1] audio-beat-detection Cycles:10 Average:149.50 Median:151.00 stddev:21.21 (14.0%) stddev-sans-first:22.50 20:42:10 INFO - PROCESS | 9444 | Values: 149.0 125.0 153.0 186.0 126.0 160.0 149.0 134.0 180.0 133.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#2] audio-dft Cycles:10 Average:164.80 Median:164.50 stddev:3.36 (2.0%) stddev-sans-first:3.50 20:42:10 INFO - PROCESS | 9444 | Values: 163.0 162.0 161.0 164.0 167.0 172.0 162.0 165.0 164.0 168.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#3] audio-fft Cycles:10 Average:93.90 Median:76.50 stddev:37.00 (48.4%) stddev-sans-first:38.67 20:42:10 INFO - PROCESS | 9444 | Values: 76.0 77.0 77.0 168.0 76.0 77.0 77.0 75.0 160.0 76.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#4] audio-oscillator Cycles:10 Average:103.10 Median:85.50 stddev:28.31 (33.1%) stddev-sans-first:29.26 20:42:10 INFO - PROCESS | 9444 | Values: 85.0 85.0 145.0 85.0 86.0 86.0 148.0 86.0 86.0 139.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#5] imaging-gaussian-blur Cycles:10 Average:117.80 Median:118.00 stddev:0.63 (0.5%) stddev-sans-first:0.60 20:42:10 INFO - PROCESS | 9444 | Values: 117.0 118.0 119.0 118.0 117.0 118.0 118.0 118.0 118.0 117.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#6] imaging-darkroom Cycles:10 Average:147.50 Median:147.50 stddev:0.71 (0.5%) stddev-sans-first:0.73 20:42:10 INFO - PROCESS | 9444 | Values: 147.0 147.0 148.0 147.0 148.0 148.0 149.0 147.0 147.0 147.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#7] imaging-desaturate Cycles:10 Average:96.10 Median:96.00 stddev:0.74 (0.8%) stddev-sans-first:0.71 20:42:10 INFO - PROCESS | 9444 | Values: 97.0 96.0 96.0 96.0 96.0 95.0 96.0 97.0 97.0 95.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#8] json-parse-financial Cycles:10 Average:54.00 Median:54.50 stddev:1.25 (2.3%) stddev-sans-first:1.32 20:42:10 INFO - PROCESS | 9444 | Values: 54.0 53.0 54.0 53.0 52.0 56.0 53.0 55.0 55.0 55.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#9] json-stringify-tinderbox Cycles:10 Average:60.40 Median:60.00 stddev:0.97 (1.6%) stddev-sans-first:1.01 20:42:10 INFO - PROCESS | 9444 | Values: 60.0 63.0 60.0 60.0 61.0 60.0 60.0 60.0 60.0 60.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#10] stanford-crypto-aes Cycles:10 Average:83.60 Median:80.50 stddev:9.03 (11.2%) stddev-sans-first:9.49 20:42:10 INFO - PROCESS | 9444 | Values: 80.0 79.0 84.0 81.0 80.0 81.0 80.0 82.0 109.0 80.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#11] stanford-crypto-ccm Cycles:10 Average:127.10 Median:129.00 stddev:5.78 (4.5%) stddev-sans-first:6.12 20:42:10 INFO - PROCESS | 9444 | Values: 126.0 122.0 127.0 120.0 121.0 122.0 133.0 134.0 135.0 131.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:162.20 Median:162.50 stddev:3.22 (2.0%) stddev-sans-first:3.32 20:42:10 INFO - PROCESS | 9444 | Values: 160.0 167.0 157.0 160.0 167.0 161.0 164.0 161.0 164.0 161.0 20:42:10 INFO - PROCESS | 9444 | 20:42:10 INFO - PROCESS | 9444 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.60 Median:64.00 stddev:1.43 (2.2%) stddev-sans-first:1.50 20:42:10 INFO - PROCESS | 9444 | Values: 64.0 66.0 65.0 64.0 64.0 68.0 64.0 64.0 64.0 63.0 20:42:10 INFO - PROCESS | 9444 | -------- Summary: end -------- 20:42:10 INFO - PROCESS | 9444 | 20:42:11 INFO - TEST-INFO | 9444: exit 0 20:42:11 INFO - TEST-OK | kraken | took 63083ms 20:42:11 INFO - SUITE-END | took 1174s 20:42:11 INFO - Completed test suite (00:19:35) 20:42:11 INFO - javascript benchmark 20:42:11 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7260.870620375269, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3054.633443986722, 3109.7356724678402, 3117.2830249042718, 3147.8740850365984, 3154.085315258575, 5324.201369794528, 5340.225667278242, 5408.972955135224, 5426.050441172799, 5481.287432633762, 5205.27126202332, 5207.583393328534, 5293.364796224459, 5341.359036915565, 5407.486288802567, 4689.4841567427475, 4696.835610753625, 4789.640776941726, 4840.080384726891, 4874.561289483946, 847.8750618422663, 4764.428268607772, 4836.709797412149, 4868.513148685139, 4888.755562221892, 4904.509549045102, 4907.582855457273, 4927.852164435055, 4947.777350019258, 4951.504849515056, 4955.479674634147, 4966.478519755446, 4975.825846095369, 4985.651004429691, 4990.326305948687, 4734.976325118352, 4749.810007599692, 4785.138675038492, 4788.04239152171, 4791.089692958327, 5192.117340052162, 5255.1329030709885, 5272.288241087443, 5276.050310944029, 5278.841634750926, 5479.835604931858, 5695.943040569624, 5761.395053519362, 5769.509591684712, 5775.104858746901, 5757.424257574251, 5810.709464526799, 5830.154627578977, 5838.7080645967535, 5882.617629854089, 5430.945690543083, 5432.320959880015, 5435.402105768362, 5440.183972404131, 5440.292761940962, 5643.379228284885, 5813.709314534256, 5822.243108395882, 5919.378465261172, 5919.67441790697, 5656.8020119295625, 5676.091825307931, 5683.119116536944, 5688.40271771458, 5701.515371193412, 5732.16883551891, 5754.338251101093, 5756.597038207369, 5756.7121643917635, 5757.453041961091, 5520.447955204448, 5626.1842032905815, 5627.549796016309, 5635.690037048002, 5673.3475650299915, 5712.0860662293835, 5726.4273572642405, 5737.168110623936, 5746.798862039892, 5747.109198074305, 4385.298352263686, 4387.692861499728, 4412.0955204183065, 4433.091216300651, 4461.24158892989, 3808.980955095207, 3907.706921980806, 3941.4876066111224, 3986.22268657609, 3987.9202415951518, 5311.28297679816, 5397.27136836522, 5423.945760542423, 5471.124620060851, 5486.259354987105, 5807.157962095473, 5809.041508151107, 5809.767609295581, 5829.154772557956, 5838.2702162229725, 5364.0, 5372.543333816591, 5378.13949768043, 5405.675659460445, 5502.394736578973, 4935.580475659609, 4949.430815456269, 4951.7276549789385, 4953.455119936804, 4974.950250497521, 5858.53131749459, 5859.560532960045, 5867.765289388377, 5870.354261031283, 5876.236089308362, 5603.075492543685, 5613.663180209201, 5660.88678226425, 5660.9150862737915, 5677.914831277451, 5843.181954526284, 5849.532037436909, 5858.794942177004, 5863.0, 5864.618799778001, 5584.525315348241, 5609.495145436767, 5613.803516876889, 5633.915491267552, 5634.577406694596, 5721.256236689203, 5741.110127930177, 5765.682887441231, 5814.76740930358, 5830.125481177857, 5546.916796248141, 5590.077637189818, 5598.692071936082, 5638.407967163553, 5642.0, 5404.945950540444, 5445.074337362578, 5574.609777315549, 5642.802501912413, 5647.068233741386, 5368.543673787615, 5425.728713564385, 5445.128779395278, 5449.427810079885, 5523.1991361253195, 5486.835394938158, 5543.8891222174525, 5578.77684892616, 5584.385717570983, 5586.078297080936, 5365.65123267002, 5487.259220005249, 5489.862753431036, 5490.286262785812, 5522.475364840334], "value": 5241.319133088725, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [571.7284289962269, 597.9402059794019, 605.382509839963, 617.1822335405589, 636.141209367354, 42122.789386053104, 43782.56217437825, 43925.34111988319, 43981.34027989575, 47955.76022119893, 45060.77469612656, 45580.0, 45649.31526027112, 45684.0, 45884.0, 8927.28581713463, 9025.593848276843, 9033.141851524128, 9041.95479022604, 9074.410163339395, 8767.123287671246, 8804.471731696087, 8847.071057538962, 8893.822123557526, 8919.955400223022, 8890.644374225023, 8964.0, 8976.551172441385, 9001.95499022504, 9009.369344145913, 8810.955945220298, 8826.691065812665, 8867.290616750677, 8890.59992300348, 8943.910560894374, 8929.374943753939, 8972.147645973622, 9004.099590041009, 9016.188543031092, 9018.909810901938, 42787.57212427867, 42840.357394639104, 43051.35422968658, 43115.78442107801, 43280.56719432797, 3785.8107094645156, 3854.8843534694006, 3867.6325749053794, 4194.412782210493, 4337.609615134653, 31942.680573194204, 32705.836470817492, 32801.343973120405, 33088.66911330904, 34095.488567671506, 4346.391505189276, 4468.084042771224, 4485.388806339773, 4510.774461276956, 4522.072975040109, 346711.0, 349777.99999999744, 350239.0, 352395.0, 354348.0, 58336.12495812566, 58705.119423208685, 58727.0, 58731.119033214534, 58732.0, 37199.81400092982, 37628.0, 37936.0, 40643.390349144785, 61937.38062619316, 14849.0, 15024.0, 15031.549053528412, 15063.774043389358, 15078.396864125312, 10945.124390048777, 11008.39453830031, 11127.165462590337, 11128.109751219883, 11142.108631309477, 19694.424446044282, 19834.107465164103, 19902.303419380252, 19929.10319035647, 20069.39791806248, 7228.891566626505, 7312.1591017033725, 7373.483856130019, 7429.925700742923, 7490.0, 987.8024395121005, 992.6277645882794, 1015.4871789746131, 1124.6963319903743, 1129.7232178116415, 31440.52839207414, 31514.842425787723, 31811.522827157147, 31960.0, 32233.838830806166, 1101.8292164714483, 1172.472387425662, 1189.8810118988206, 1215.7568486302775, 1220.1824777399163, 16844.91577542129, 16863.15684215809, 16906.74639880403, 16988.49034528966, 17239.05185214825, 532419.0, 544472.0, 544643.0, 551559.0, 551644.0, 60225.69887150536, 60468.09297860535, 60834.39165608287, 60852.391476085555, 61107.694461527404, 1215.5502464088167, 1251.7246205834701, 1289.8968082553374, 1344.0927374022497, 1350.3113412159673, 30690.0, 31122.844385777928, 31453.02392545409, 31654.208644784063, 32342.029739107864, 51218.74390628023, 51700.74149629228, 52092.73953630208, 52144.0, 52525.0, 491342.0, 494520.6917757861, 495710.0, 497338.0, 499152.0, 29093.0, 29108.417831643674, 29131.0, 29207.0, 29269.0, 48547.0, 49098.26352604642, 49867.50132498628, 49941.500584993686, 50446.24330635117, 39771.0, 41720.0, 42110.36834447424, 42685.78657106694, 42867.57132428636, 41558.1688366237, 41771.91799635477, 42127.1574568513, 42235.577644223165, 42329.78835105805, 36182.638173617925, 40222.1955560893, 40317.59682403256, 40988.0, 41123.58876411198, 35197.82401088081, 35899.641003590674, 36702.63297366992, 37096.0, 37736.0, 28301.433971320046, 28844.278893027844, 28870.133895983156, 29015.564766528096, 29141.7085829139], "value": 20176.197264782404, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [396.181884408696, 405.1128029615141, 408.18974335943165, 408.5607971430712, 419.00904361185803, 18030.18864151113, 19262.51843703908, 19716.70424943625, 19765.110570024346, 20444.28445004425, 18676.53308667284, 18983.33558325459, 19511.804881951175, 19675.803241967576, 19686.310979115733, 5600.215969764236, 5651.660900345993, 5651.745671444774, 5714.0, 5729.28383952006, 5572.637778544402, 5609.298837645294, 5644.520215781664, 5648.717564121798, 5680.4319568043275, 5554.50009499145, 5619.297587801525, 5653.180288858113, 5659.320881494205, 5669.659820410789, 5600.915986260209, 5602.887942241153, 5620.5503559715125, 5626.859328516799, 5640.351359593617, 4930.80276788928, 4976.253561965698, 5002.52476014778, 5038.622103342227, 5042.823501177478, 21934.780652193433, 22181.0, 22886.313410597708, 23028.884855575616, 23130.42173945648, 2108.230495869012, 2253.9323820285417, 2328.092044102801, 2423.454722687381, 2484.6148846928754, 10346.224033197464, 10488.05607495329, 10493.580256789719, 10507.579696812118, 10715.892841071567, 1910.379126783787, 1987.7515310586177, 1999.9400017999483, 2010.4370776182693, 2010.6079314533672, 79215.0, 81992.0, 83555.99999999939, 84477.0, 85587.5720621393, 11198.104151667847, 11205.831912521318, 11334.546618135182, 11394.544218231178, 11429.59996400122, 15381.15426148847, 15694.9215253923, 15747.13390763519, 15764.290606922716, 15786.526404207892, 7254.419646428273, 7280.890786638205, 7581.962090189514, 7771.406861593473, 7839.137694853562, 6827.761028363983, 7012.544184627983, 7017.806972814634, 7120.2167761547225, 7256.201817800038, 4791.688540244873, 4800.303955926371, 4834.154023045953, 4844.709317440965, 4896.877578060506, 1968.3307675390436, 2007.829334506554, 2040.734704488407, 2055.290924631, 2061.3300677279944, 943.297243553557, 963.1957315641517, 969.3360048366891, 984.3601658921615, 1064.7178497698117, 19056.333028343943, 19421.611567768567, 19469.318573849847, 19556.511087222934, 19713.605727885362, 980.3921568627496, 1007.3452256033637, 1022.9283950123569, 1034.1416624201895, 1039.4542864995938, 10333.94833025845, 11012.669619911416, 11095.611653592085, 11145.2198346115, 11200.159988000933, 414730.0, 420810.0, 421255.0, 422089.0, 429318.0, 93848.0, 94304.0, 96855.51572242235, 98277.0, 100347.0, 970.4371464550544, 972.3971137894409, 1023.3501726403639, 1044.0, 1050.2333296693457, 17446.389376371768, 17515.737263941304, 17518.824811751718, 17563.297468101642, 17837.73243401324, 30543.2364190897, 33043.66956330406, 41940.07846272996, 44724.55275447204, 44931.55068449274, 53269.0, 54599.0, 56977.0, 59540.70229648824, 64532.0, 8886.422382545114, 9028.0, 9118.498482583522, 9183.54082295896, 9306.395084319498, 6622.437092847162, 9664.371815831948, 14199.64500887486, 14335.0, 14342.569722908329, 11372.20394572372, 11729.296242225493, 12137.21108127969, 12215.816762748389, 12570.245785252913, 12283.385830708608, 12326.50693972231, 12416.627501174979, 12508.812367814307, 12536.498540058661, 12035.0, 12486.687832804253, 12535.686607834512, 12580.685482863002, 12720.236785792882, 8931.0, 8989.82020359576, 9016.143466370684, 9096.818063638559, 9117.680881169392, 9372.062793720574, 12133.75732485363, 12162.270263784201, 12466.127371083938, 12743.362831858556], "value": 9193.385208104288, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1457.3587621446563, 1498.1310839712967, 1589.276879020046, 1758.6570618729345, 1779.4394765648813, 7614.086309642837, 8712.215900568948, 8716.215540601344, 9393.436393816375, 9395.859062114074, 8748.518831464267, 9033.548322583878, 9047.502387368691, 9093.13615206556, 9169.358144929842, 2334.789868911802, 2376.370261880603, 2394.0423830467867, 2398.7121545414575, 2407.037185125946, 2328.2316835444262, 2348.8842799670106, 2375.726791418983, 2410.590199666061, 2423.079229892647, 2371.6561098640686, 2378.8096952243777, 2381.678473406094, 2410.2287268074138, 2415.118481754165, 2322.976770232293, 2331.603627383349, 2348.1311914591624, 2350.9177178798745, 2386.331827088418, 2332.9650055249185, 2335.065973610552, 2335.2760644200184, 2337.1118974789642, 2349.682792822964, 9099.272058235325, 9236.79921610193, 9247.861282080774, 9253.6298548058, 9277.396969197049, 5204.271402003723, 5270.841874743764, 5288.338957630296, 5318.601104917108, 5325.1479763238085, 3485.8257087145794, 3503.632118627558, 3539.876104336336, 3604.1350075981577, 3613.8735144270086, 1208.9758204835941, 1223.743013967068, 1226.6136167107422, 1236.369451579692, 1266.1580049267227, 12928.48286068556, 12953.805692914613, 13003.219806811527, 13036.478540858354, 13080.476780928751, 4688.2733176357715, 4854.8786280342565, 4933.235348520985, 4934.3338649282605, 4942.258661200849, 10826.133909287395, 10850.62022829213, 10895.727606809893, 10906.672799816019, 10989.285696429706, 5287.550558202519, 5332.733363331896, 5342.5993050521365, 5369.087255166631, 5382.869597384515, 4256.91486170281, 4759.809607615726, 4763.499832517536, 4885.096257192431, 4915.754212289371, 4093.283675356801, 4125.43233571247, 4127.669786417079, 4159.688023398257, 4214.1150358425075, 1322.7883538633964, 1327.2637525366256, 1333.3466601365456, 1342.6975833441545, 1347.9730405391838, 832.7834762961553, 889.7553172877381, 989.1147423056324, 990.8860481044773, 1003.7340104872214, 5635.915461268084, 5885.352611212763, 5924.7333869975955, 6014.609050411709, 6070.969645151746, 954.9278066595505, 987.6839411388287, 999.6850991937516, 1015.0864222199931, 1031.0359813574332, 4027.617376349242, 4032.8790136295956, 4043.8584649537715, 4047.5371165537417, 4075.3275709508193, 11293.265937714023, 11760.94119529414, 11772.587959421551, 11807.23252988553, 11839.704007399883, 11541.0, 11547.249428787101, 11640.06879449642, 11645.708857278636, 11661.708457288636, 8216.753497395088, 8445.197706218023, 8455.408121431563, 8465.153484651608, 8468.745937621881, 5759.964849035488, 5797.710114494343, 5942.435468630473, 6038.909416358846, 6154.046122850965, 9738.610455581698, 10505.527251273557, 10530.262881598215, 10608.575656973944, 10696.89303106959, 10205.285630005828, 10433.426161561187, 10454.372737635766, 10496.947515262375, 10600.787984240425, 7288.0, 7452.3665488431925, 7613.733519326797, 7989.7203597873795, 8174.959125204336, 8271.296939760188, 8314.002319721672, 8316.126806685454, 8320.126386729306, 8398.0, 7541.585212813348, 7716.652750626123, 7807.492512986865, 7889.211078892295, 7922.841543169219, 7361.668724907499, 7512.8873066905135, 7513.661885215288, 7597.772066838003, 7619.428542859197, 7102.715891364288, 7154.0, 7174.174969878322, 7187.712491500491, 7190.96404517974, 4859.927101093557, 4870.4155501340065, 5032.6225533084435, 5062.569681577107, 5103.132467480612, 4870.95129048705, 4907.975460122677, 4913.828016019422, 4954.157793175241, 4966.701997880139], "value": 4739.988656789069, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [332.5195093090484, 334.15792203646794, 334.35636399930144, 342.06786506769043, 344.9913752156194, 5529.502344788968, 5655.858603534909, 5664.263645726055, 5671.432856714327, 5674.531578763231, 5552.583556233289, 5553.972230138854, 5564.276644036279, 5571.8328450146455, 5596.664200147994, 4145.585441455853, 4181.456410666609, 4305.763183024932, 4317.309230523117, 4333.155034768221, 4290.54949230331, 4319.870403887872, 4324.697271191002, 4333.198358303708, 4338.783060846945, 4290.935635965463, 4301.010767523471, 4301.182775272704, 4303.139372125572, 4312.805923733424, 4078.062045729484, 4304.440422745039, 4304.78476076195, 4326.437563116775, 4331.938675024639, 3774.358359078963, 3787.14789172434, 3792.5259342582176, 3796.791176485292, 3812.5424949006297, 5467.644603100825, 5468.453154684539, 5471.562275018029, 5491.341039075297, 5496.203050557647, 4896.824762057081, 4901.362822833009, 4905.730184839832, 4909.3126962225315, 4961.3798275215595, 5777.133429985493, 5824.767009319622, 5840.561957853178, 5853.795117170878, 5855.882882342329, 4176.812043458051, 4177.101923086551, 4182.519010313792, 4189.05746207104, 4191.937120943188, 5854.882902341929, 6063.423974722395, 6100.847478813065, 6115.266168059861, 6120.755169793203, 4173.8956526087095, 4225.767582782976, 4228.534861165269, 4229.978850105791, 4245.150969806051, 4247.87256382309, 4258.936115958263, 4274.337477690963, 4274.978625106854, 4278.187144442608, 4773.451053128934, 4839.395075615548, 4857.222844344888, 4858.902821943541, 4901.215805471107, 5846.853828654318, 5857.0, 5867.911981320283, 5910.408959104141, 5948.323254535477, 1489.1586253766586, 1492.4776328285013, 1496.9596130689067, 1498.0412535976984, 1502.1587910770004, 916.5692124701379, 934.3179478980383, 934.9995504809788, 936.1995493852794, 937.7702462896634, 5055.873603159876, 5064.860406408528, 5080.034793389318, 5104.464031276737, 5114.442778610694, 5362.91955620666, 5382.730863456812, 5383.415960338981, 5408.107662235687, 5462.426445223274, 5099.898002039939, 5138.820141295037, 5338.572914166935, 5772.336181339116, 5791.189233507313, 3241.3193229422086, 3264.6245681746905, 3264.8041117533025, 3271.362084393568, 3276.737860971117, 6010.767792602506, 6248.219257511678, 6319.431251187415, 6338.714757835908, 6355.682215889187, 6173.3146081454715, 6192.566520343533, 6192.752289908443, 6197.163382943245, 6203.193584833943, 6189.659568723673, 6201.348858369806, 6220.191375121205, 6226.719797609118, 6246.875062498815, 5810.215620891126, 6070.271567411763, 6084.787032453843, 6106.969465152646, 6118.694065296806, 6010.218671572842, 6019.578629495893, 6022.187004754477, 6036.607620504653, 6045.667488288186, 6023.30731965812, 6223.439890409703, 6230.6884655766125, 6275.937240627718, 6292.622442653455, 4305.763183024964, 4326.567343265649, 4327.350897365421, 4330.8306757176015, 4344.5221025686515, 5779.248697669276, 5881.853038657421, 5922.7927022554, 5928.673922934107, 6096.719688865388, 5827.155062515996, 5849.0, 5855.443732845373, 5855.707214639166, 5919.171316015675, 5871.4715675589405, 5872.735726892385, 5881.32364778056, 5894.2926848778425, 5907.675077870758, 5541.5843811715085, 5880.706244626175, 5896.351401345934, 5904.468597826216, 5907.202527658883, 5863.882722345615, 5897.5281977440845, 5924.407559244041, 6012.549058820518, 6019.608725432833, 5654.953833540643, 5680.204771331934, 5786.07422812348, 5801.767929282782, 5831.94168058314], "value": 4426.083268644764, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [738.2138023005502, 752.4131177681404, 758.909749262171, 786.4259090863671, 802.1497212954267, 14714.190719510423, 14917.179555124463, 14986.0, 14989.775153372708, 14994.250287485624, 14728.852711472882, 14745.77881331781, 14812.0, 14817.11097334158, 14819.333130009149, 646.3439608797074, 766.2414209932183, 767.6890859202032, 782.2138750555683, 782.949108307961, 777.5334799120511, 778.6418247606108, 779.6218833865571, 782.0576205672152, 784.1609477858693, 831.3141658132065, 831.6673330667751, 832.8584140696066, 835.2357592802579, 835.678263868409, 825.9463134896242, 831.0733532111682, 831.7463173732009, 834.0075310380658, 834.8497270491309, 603.3303033632665, 605.9606125601866, 606.9908951365733, 608.1880689279817, 608.7747533412621, 14771.926140369336, 14797.334119964627, 14807.70384592313, 14833.110013399122, 14883.18142502162, 12589.244645321218, 12653.430595623218, 15289.923550382287, 15569.532914012598, 15787.921060394625, 13122.671933201651, 13202.867971320356, 13300.86699133006, 13520.864791352158, 13574.932125339408, 4515.119551687422, 4546.795394207269, 4572.154151481986, 4607.723536587815, 4612.607928326096, 75856.24143758547, 77298.61350693267, 79393.20606793916, 80273.59863200647, 81323.5933820327, 11008.284461510137, 11182.0, 11280.661580152608, 11305.26515776472, 11348.205625606293, 20208.19167233294, 20211.595768084557, 20252.392428227176, 20277.391678249674, 20287.18851245963, 8094.15011423792, 8097.149799271109, 8172.42793004484, 8228.588570571448, 8257.21556452136, 4406.166635027546, 4462.48681401643, 4465.37484752135, 4465.754383508874, 4575.679702420799, 3420.452727563578, 3523.224890524081, 3531.805750683686, 3538.7699799513466, 3549.2723991581665, 584.8187062010705, 588.9558283128782, 604.157200705014, 613.929398119213, 615.3446579392933, 669.3473862983552, 695.6730336741723, 700.1807884774826, 707.5224223649119, 709.386380780621, 8680.522571258514, 8681.262092722189, 9422.776911076335, 9506.47714375716, 9628.807423851484, 630.9936900631027, 639.5555089212952, 640.2029473305671, 675.2504719761159, 686.1628812848317, 4436.157130145262, 4539.909201815945, 4607.976960115245, 4622.838200662961, 4645.953540464552, 89146.0, 104166.4791676052, 104433.0, 105159.47420263002, 105446.47276763567, 87981.12018879729, 89359.55320223357, 89385.55307223552, 89841.55079224562, 91205.54397227972, 85258.58965641429, 85432.0, 85877.0, 88819.55590222137, 89525.0, 8306.70926517569, 8349.290310323448, 8394.58027098655, 8490.278326342082, 8580.14198580137, 51870.74064629653, 52543.0, 52557.73721131523, 53904.46095538994, 54583.0, 65529.412941093666, 74261.0, 76001.61999189969, 76874.61562692151, 78584.21415785768, 10699.625513107005, 10977.28647637901, 10985.285956412808, 11194.216404851582, 11247.775044499227, 11066.39134847591, 11347.886521135013, 11737.706557336134, 11899.107566932687, 12232.449539770909, 11669.88330116688, 11672.474738636613, 11727.237729547553, 11780.587679431179, 12296.139270251355, 11137.665870023913, 11306.84390406503, 11354.772904542027, 11399.658010259705, 11921.0, 11639.6508104757, 11763.0, 11912.463939122586, 11925.0, 12083.57707480234, 8862.778430539289, 9170.761947137318, 9192.448453092837, 9256.57826002611, 9423.19902808269, 9251.814963700823, 9359.766005849908, 9373.343865929592, 9399.483028433227, 9407.529623518934], "value": 7183.5148246420795, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1536.7, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 108.0, 113.0, 111.0, 111.0, 113.0, 112.0, 113.0, 113.0, 114.0], "value": 112.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 125.0, 153.0, 186.0, 126.0, 160.0, 149.0, 134.0, 180.0, 133.0], "value": 149.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 162.0, 161.0, 164.0, 167.0, 172.0, 162.0, 165.0, 164.0, 168.0], "value": 164.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 77.0, 77.0, 168.0, 76.0, 77.0, 77.0, 75.0, 160.0, 76.0], "value": 93.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 145.0, 85.0, 86.0, 86.0, 148.0, 86.0, 86.0, 139.0], "value": 103.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 118.0, 119.0, 118.0, 117.0, 118.0, 118.0, 118.0, 118.0, 117.0], "value": 117.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 148.0, 147.0, 148.0, 148.0, 149.0, 147.0, 147.0, 147.0], "value": 147.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 96.0, 96.0, 96.0, 96.0, 95.0, 96.0, 97.0, 97.0, 95.0], "value": 96.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 53.0, 54.0, 53.0, 52.0, 56.0, 53.0, 55.0, 55.0, 55.0], "value": 54.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 63.0, 60.0, 60.0, 61.0, 60.0, 60.0, 60.0, 60.0, 60.0], "value": 60.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 79.0, 84.0, 81.0, 80.0, 81.0, 80.0, 82.0, 109.0, 80.0], "value": 83.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [126.0, 122.0, 127.0, 120.0, 121.0, 122.0, 133.0, 134.0, 135.0, 131.0], "value": 127.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 167.0, 157.0, 160.0, 167.0, 161.0, 164.0, 161.0, 164.0, 161.0], "value": 162.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 66.0, 65.0, 64.0, 64.0, 68.0, 64.0, 64.0, 64.0, 63.0], "value": 64.6, "unit": "score"}]}]} 20:42:11 INFO - Return code: 0 20:42:12 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 20:42:12 ERROR - # TBPL SUCCESS # 20:42:12 INFO - Running post-action listener: _resource_record_post_action 20:42:12 INFO - ##### 20:42:12 INFO - ##### Finished run-tests step (success) 20:42:12 INFO - ##### 20:42:12 INFO - Running post-run listener: _resource_record_post_run 20:42:12 INFO - Total resource usage - Wall time: 1193s; CPU: 14.0%; Read bytes: 12288; Write bytes: 561840128; Read time: 1068; Write time: 1443240 20:42:12 INFO - TinderboxPrint: CPU usage
13.5% 20:42:12 INFO - TinderboxPrint: I/O read bytes / time
12,288 / 1,068 20:42:12 INFO - TinderboxPrint: I/O write bytes / time
561,840,128 / 1,443,240 20:42:12 INFO - TinderboxPrint: CPU idle
8,226.3 (86.4%) 20:42:12 INFO - TinderboxPrint: CPU user
1,217.8 (12.8%) 20:42:12 INFO - TinderboxPrint: Swap in / out
0 / 0 20:42:12 INFO - install - Wall time: 17s; CPU: 21.0%; Read bytes: 4096; Write bytes: 273608704; Read time: 540; Write time: 965032 20:42:12 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 8192; Write bytes: 288231424; Read time: 528; Write time: 478208 20:42:12 INFO - Running post-run listener: _upload_blobber_files 20:42:12 INFO - Blob upload gear active. 20:42:12 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 20:42:12 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 20:42:12 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', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 20:42:12 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 Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 20:42:13 INFO - (blobuploader) - INFO - Open directory for files ... 20:42:13 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 20:42:13 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:42:13 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:42:17 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 20:42:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:42:17 INFO - (blobuploader) - INFO - Done attempting. 20:42:17 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 20:42:17 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:42:17 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:42:17 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 20:42:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:42:17 INFO - (blobuploader) - INFO - Done attempting. 20:42:17 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 20:42:17 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 20:42:17 INFO - (blobuploader) - INFO - Uploading, attempt #1. 20:42:18 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 20:42:18 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 20:42:18 INFO - (blobuploader) - INFO - Done attempting. 20:42:18 INFO - (blobuploader) - INFO - Iteration through files over. 20:42:18 INFO - Return code: 0 20:42:18 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 20:42:18 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 20:42:18 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a05ac3d6cbadf2fa5affb5355db6ca2fc2601a42cd82088859e30fff95d4847d2b93f0a36022faaca8e279a33799c914270dd857776baef7626d7323b4faa260", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/82beced4d634ad85ec1cfb0ac14b38ec4b9959dda915a35e2abc66625b86c0e1b1f5cc730aeacda9a34c64b73b8c1d64635fa89d71d2d655ea8adae389128679", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/5d749345a9b3d6fd24c38e0640e8f1495bbe594b9bb169d9166a5b6e85573a334225fb5989d1c892461a2b4ff1bfb3c5da8b37147986bd387733a739d45cb3e1"} 20:42:18 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 20:42:18 INFO - Writing to file /builds/slave/test/properties/blobber_files 20:42:18 INFO - Contents: 20:42:18 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a05ac3d6cbadf2fa5affb5355db6ca2fc2601a42cd82088859e30fff95d4847d2b93f0a36022faaca8e279a33799c914270dd857776baef7626d7323b4faa260", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/82beced4d634ad85ec1cfb0ac14b38ec4b9959dda915a35e2abc66625b86c0e1b1f5cc730aeacda9a34c64b73b8c1d64635fa89d71d2d655ea8adae389128679", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/5d749345a9b3d6fd24c38e0640e8f1495bbe594b9bb169d9166a5b6e85573a334225fb5989d1c892461a2b4ff1bfb3c5da8b37147986bd387733a739d45cb3e1"} 20:42:18 INFO - Running post-run listener: copy_logs_to_upload_dir 20:42:18 INFO - Copying logs to upload dir... 20:42:18 INFO - mkdir: /builds/slave/test/build/upload/logs 20:42:18 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1237.760698 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-06-14 20:42:17.881811) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-14 20:42:17.885044) ========= 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=745a4373a2a16df560f216e000000264-1465954094.342761-283144773 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a05ac3d6cbadf2fa5affb5355db6ca2fc2601a42cd82088859e30fff95d4847d2b93f0a36022faaca8e279a33799c914270dd857776baef7626d7323b4faa260", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/82beced4d634ad85ec1cfb0ac14b38ec4b9959dda915a35e2abc66625b86c0e1b1f5cc730aeacda9a34c64b73b8c1d64635fa89d71d2d655ea8adae389128679", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/5d749345a9b3d6fd24c38e0640e8f1495bbe594b9bb169d9166a5b6e85573a334225fb5989d1c892461a2b4ff1bfb3c5da8b37147986bd387733a739d45cb3e1"} build_url:https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011452 build_url: 'https://queue.taskcluster.net/v1/task/POkFHShRSS2OeyLifsZfVw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a05ac3d6cbadf2fa5affb5355db6ca2fc2601a42cd82088859e30fff95d4847d2b93f0a36022faaca8e279a33799c914270dd857776baef7626d7323b4faa260", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/82beced4d634ad85ec1cfb0ac14b38ec4b9959dda915a35e2abc66625b86c0e1b1f5cc730aeacda9a34c64b73b8c1d64635fa89d71d2d655ea8adae389128679", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/5d749345a9b3d6fd24c38e0640e8f1495bbe594b9bb169d9166a5b6e85573a334225fb5989d1c892461a2b4ff1bfb3c5da8b37147986bd387733a739d45cb3e1"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-14 20:42:17.920356) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:42:17.920731) ========= 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=745a4373a2a16df560f216e000000264-1465954094.342761-283144773 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004456 ========= master_lag: 0.07 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-14 20:42:17.999454) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-14 20:42:18.001927) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-14 20:42:18.002284) ========= ========= Total master_lag: 0.21 =========