builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-068 starttime: 1466086814.91 results: success (0) buildid: 20160616043206 builduid: 7701161eed8b45c2aff31d680c0e7f10 revision: 44256084ae2e8a2777eeaf040f8bdb584a818ef8 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-16 07:20:14.906342) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-16 07:20:14.906887) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-16 07:20:14.907208) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-16 07:20:14.922531) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 07:20:14.922840) ========= 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=97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-16 07:20:17-- 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% 46.3M=0s 2016-06-16 07:20:17 (46.3 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.118757 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 07:20:15.055878) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 07:20:15.056246) ========= 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=97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020393 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 07:20:15.106379) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-06-16 07:20:15.106762) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 44256084ae2e8a2777eeaf040f8bdb584a818ef8 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 44256084ae2e8a2777eeaf040f8bdb584a818ef8 --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=97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-16 07:20:17,672 truncating revision to first 12 chars 2016-06-16 07:20:17,672 Setting DEBUG logging. 2016-06-16 07:20:17,672 attempt 1/10 2016-06-16 07:20:17,672 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/44256084ae2e?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-16 07:20:18,830 unpacking tar archive at: mozilla-inbound-44256084ae2e/testing/mozharness/ program finished with exit code 0 elapsedTime=1.477841 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-06-16 07:20:16.597996) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-16 07:20:16.598334) ========= script_repo_revision: 44256084ae2e8a2777eeaf040f8bdb584a818ef8 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-16 07:20:16.598752) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-16 07:20:16.599027) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-16 07:20:16.609984) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2016-06-16 07:20:16.610261) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] 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=97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:20:19 INFO - MultiFileLogger online at 20160616 07:20:19 in /builds/slave/test 07:20:19 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 07:20:19 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 07:20:19 INFO - {'append_to_log': False, 07:20:19 INFO - 'base_work_dir': '/builds/slave/test', 07:20:19 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 07:20:19 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 07:20:19 INFO - 'branch': 'Mozilla-Inbound', 07:20:19 INFO - 'buildbot_json_path': 'buildprops.json', 07:20:19 INFO - 'config_files': ('talos/linux_config.py',), 07:20:19 INFO - 'default_actions': ('clobber', 07:20:19 INFO - 'read-buildbot-config', 07:20:19 INFO - 'download-and-extract', 07:20:19 INFO - 'populate-webroot', 07:20:19 INFO - 'create-virtualenv', 07:20:19 INFO - 'install', 07:20:19 INFO - 'run-tests'), 07:20:19 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:20:19 INFO - 'download_minidump_stackwalk': True, 07:20:19 INFO - 'download_symbols': 'ondemand', 07:20:19 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:20:19 INFO - 'tooltool.py': '/tools/tooltool.py', 07:20:19 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:20:19 INFO - '/tools/misc-python/virtualenv.py')}, 07:20:19 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:20:19 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:20:19 INFO - 'installer_path': 'installer.exe', 07:20:19 INFO - 'log_level': 'info', 07:20:19 INFO - 'log_name': 'talos', 07:20:19 INFO - 'log_to_console': True, 07:20:19 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:20:19 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:20:19 INFO - 'opt_config_files': (), 07:20:19 INFO - 'pip_index': False, 07:20:19 INFO - 'sps_profile': False, 07:20:19 INFO - 'sps_profile_interval': 0, 07:20:19 INFO - 'suite': 'dromaeojs-e10s', 07:20:19 INFO - 'system_bits': '32', 07:20:19 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:20:19 INFO - 'title': 'talos-linux64-ix-068', 07:20:19 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:20:19 INFO - 'use_talos_json': True, 07:20:19 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 07:20:19 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:20:19 INFO - 'work_dir': 'build'} 07:20:19 INFO - ##### 07:20:19 INFO - ##### Running clobber step. 07:20:19 INFO - ##### 07:20:19 INFO - Running pre-action listener: _resource_record_pre_action 07:20:19 INFO - Running main action method: clobber 07:20:19 INFO - rmtree: /builds/slave/test/build 07:20:19 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 07:20:19 INFO - Running post-action listener: _resource_record_post_action 07:20:19 INFO - ##### 07:20:19 INFO - ##### Finished clobber step (success) 07:20:19 INFO - ##### 07:20:19 INFO - ##### 07:20:19 INFO - ##### Running read-buildbot-config step. 07:20:19 INFO - ##### 07:20:19 INFO - Running pre-action listener: _resource_record_pre_action 07:20:19 INFO - Running main action method: read_buildbot_config 07:20:19 INFO - Using buildbot properties: 07:20:19 INFO - { 07:20:19 INFO - "project": "", 07:20:19 INFO - "product": "firefox", 07:20:19 INFO - "script_repo_revision": "production", 07:20:19 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s", 07:20:19 INFO - "repository": "", 07:20:19 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs-e10s", 07:20:19 INFO - "buildid": "20160616043206", 07:20:19 INFO - "pgo_build": "True", 07:20:19 INFO - "basedir": "/builds/slave/test", 07:20:19 INFO - "buildnumber": 1164, 07:20:19 INFO - "slavename": "talos-linux64-ix-068", 07:20:19 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 07:20:19 INFO - "platform": "ubuntu64_hw", 07:20:19 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos", 07:20:19 INFO - "branch": "mozilla-inbound", 07:20:19 INFO - "repo_path": "integration/mozilla-inbound", 07:20:19 INFO - "revision": "44256084ae2e8a2777eeaf040f8bdb584a818ef8", 07:20:19 INFO - "stage_platform": "linux64-pgo", 07:20:19 INFO - "builduid": "7701161eed8b45c2aff31d680c0e7f10", 07:20:19 INFO - "slavebuilddir": "test" 07:20:19 INFO - } 07:20:19 INFO - Found installer url https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 07:20:19 INFO - Running post-action listener: _resource_record_post_action 07:20:19 INFO - ##### 07:20:19 INFO - ##### Finished read-buildbot-config step (success) 07:20:19 INFO - ##### 07:20:19 INFO - ##### 07:20:19 INFO - ##### Running download-and-extract step. 07:20:19 INFO - ##### 07:20:19 INFO - Running pre-action listener: _resource_record_pre_action 07:20:19 INFO - Running main action method: download_and_extract 07:20:19 INFO - mkdir: /builds/slave/test/build/tests 07:20:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:19 INFO - https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 07:20:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 07:20:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 07:20:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/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 07:20:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/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 07:20:20 INFO - Downloaded 1361 bytes. 07:20:20 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 07:20:20 INFO - Using the following test package requirements: 07:20:20 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 07:20:20 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:20 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 07:20:20 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:20 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 07:20:20 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:20 INFO - u'jsshell-linux-x86_64.zip'], 07:20:20 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:20 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 07:20:20 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 07:20:20 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:20 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 07:20:20 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:20 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 07:20:20 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:20 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 07:20:20 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 07:20:20 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 07:20:20 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 07:20:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:20 INFO - https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:20:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:20:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:20:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/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 07:20:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/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 07:20:21 INFO - Downloaded 24220980 bytes. 07:20:21 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'] 07:20:21 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 07:20:22 INFO - Return code: 0 07:20:22 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 07:20:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:22 INFO - https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:20:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:20:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 07:20:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/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 07:20:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/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 07:20:23 INFO - Downloaded 24220980 bytes. 07:20:23 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'] 07:20:23 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 07:20:25 INFO - Return code: 0 07:20:25 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')]} 07:20:25 INFO - https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 07:20:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 07:20:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 07:20:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/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 07:20:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/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 07:20:26 INFO - Downloaded 14405384 bytes. 07:20:26 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'] 07:20:26 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 07:20:26 INFO - Return code: 0 07:20:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:26 INFO - https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 07:20:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:20:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:20:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/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 07:20:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/L3dwgPn_SZiDbUurYp-_Lg/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 07:20:28 INFO - Downloaded 59400571 bytes. 07:20:28 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:20:28 INFO - mkdir: /builds/slave/test/properties 07:20:28 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 07:20:28 INFO - Writing to file /builds/slave/test/properties/build_url 07:20:28 INFO - Contents: 07:20:28 INFO - build_url:https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 07:20:29 INFO - Running post-action listener: _resource_record_post_action 07:20:29 INFO - Running post-action listener: set_extra_try_arguments 07:20:29 INFO - ##### 07:20:29 INFO - ##### Finished download-and-extract step (success) 07:20:29 INFO - ##### 07:20:29 INFO - ##### 07:20:29 INFO - ##### Running populate-webroot step. 07:20:29 INFO - ##### 07:20:29 INFO - Running pre-action listener: _resource_record_pre_action 07:20:29 INFO - Running main action method: populate_webroot 07:20:29 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:20:29 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:20:29 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:20:29 INFO - '--tppagecycles', 07:20:29 INFO - '7'], 07:20:29 INFO - 'tests': ['tsvgm']}}, 07:20:29 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 07:20:29 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:20:29 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 07:20:29 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 07:20:29 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:20:29 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 07:20:29 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:29 INFO - 'talos_options': ['--disable-e10s'], 07:20:29 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:20:29 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:29 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:20:29 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:29 INFO - 'talos_options': ['--disable-e10s'], 07:20:29 INFO - 'tests': ['damp', 'tps']}, 07:20:29 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:29 INFO - 'tests': ['damp', 'tps']}, 07:20:29 INFO - 'g3': {'talos_options': ['--disable-e10s'], 07:20:29 INFO - 'tests': ['dromaeo_dom']}, 07:20:29 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:20:29 INFO - 'g4': {'talos_options': ['--disable-e10s'], 07:20:29 INFO - 'tests': ['basic_compositor_video']}, 07:20:29 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 07:20:29 INFO - 'other': {'talos_options': ['--disable-e10s'], 07:20:29 INFO - 'tests': ['a11yr', 07:20:29 INFO - 'ts_paint', 07:20:29 INFO - 'tpaint', 07:20:29 INFO - 'sessionrestore', 07:20:29 INFO - 'sessionrestore_no_auto_restore', 07:20:29 INFO - 'tabpaint']}, 07:20:29 INFO - 'other-e10s': {'tests': ['a11yr', 07:20:29 INFO - 'ts_paint', 07:20:29 INFO - 'tpaint', 07:20:29 INFO - 'sessionrestore', 07:20:29 INFO - 'sessionrestore_no_auto_restore', 07:20:29 INFO - 'tabpaint']}, 07:20:29 INFO - 'other-e10s_l64': {'tests': ['a11yr', 07:20:29 INFO - 'ts_paint', 07:20:29 INFO - 'tpaint', 07:20:29 INFO - 'sessionrestore', 07:20:29 INFO - 'sessionrestore_no_auto_restore', 07:20:29 INFO - 'tabpaint']}, 07:20:29 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 07:20:29 INFO - 'ts_paint', 07:20:29 INFO - 'tpaint', 07:20:29 INFO - 'sessionrestore', 07:20:29 INFO - 'sessionrestore_no_auto_restore', 07:20:29 INFO - 'tabpaint']}, 07:20:29 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 07:20:29 INFO - 'tests': ['a11yr', 07:20:29 INFO - 'ts_paint', 07:20:29 INFO - 'tpaint', 07:20:29 INFO - 'sessionrestore', 07:20:29 INFO - 'sessionrestore_no_auto_restore', 07:20:29 INFO - 'tabpaint']}, 07:20:29 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 07:20:29 INFO - 'tests': ['a11yr', 07:20:29 INFO - 'ts_paint', 07:20:29 INFO - 'tpaint', 07:20:29 INFO - 'sessionrestore', 07:20:29 INFO - 'sessionrestore_no_auto_restore', 07:20:29 INFO - 'tabpaint']}, 07:20:29 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 07:20:29 INFO - 'tests': ['tsvgx', 07:20:29 INFO - 'tsvgr_opacity', 07:20:29 INFO - 'tart', 07:20:29 INFO - 'tscrollx', 07:20:29 INFO - 'cart']}, 07:20:29 INFO - 'svgr-e10s': {'tests': ['tsvgx', 07:20:29 INFO - 'tsvgr_opacity', 07:20:29 INFO - 'tart', 07:20:29 INFO - 'tscrollx', 07:20:29 INFO - 'cart']}, 07:20:29 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:29 INFO - 'talos_options': ['--disable-e10s'], 07:20:29 INFO - 'tests': ['tp5o']}, 07:20:29 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:29 INFO - 'tests': ['tp5o']}, 07:20:29 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:29 INFO - 'talos_options': ['--disable-e10s', 07:20:29 INFO - '--xperf_path', 07:20:29 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:20:29 INFO - 'tests': ['tp5n']}, 07:20:29 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:20:29 INFO - 'talos_options': ['--xperf_path', 07:20:29 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:20:29 INFO - 'tests': ['tp5n']}}, 07:20:29 INFO - 'talos.zip': {'path': '', 07:20:29 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:20:29 INFO - Running post-action listener: _resource_record_post_action 07:20:29 INFO - ##### 07:20:29 INFO - ##### Finished populate-webroot step (success) 07:20:29 INFO - ##### 07:20:29 INFO - ##### 07:20:29 INFO - ##### Running create-virtualenv step. 07:20:29 INFO - ##### 07:20:29 INFO - Running pre-action listener: _resource_record_pre_action 07:20:29 INFO - Running main action method: create_virtualenv 07:20:29 INFO - Creating virtualenv /builds/slave/test/build/venv 07:20:29 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 07:20:29 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 07:20:29 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:20:29 INFO - Using real prefix '/usr' 07:20:29 INFO - New python executable in /builds/slave/test/build/venv/bin/python 07:20:29 INFO - Installing distribute.............................................................................................................................................................................................done. 07:20:31 INFO - Installing pip.................done. 07:20:31 INFO - Return code: 0 07:20:31 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 07:20:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe303911f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x295b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a26350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ab51c0>, '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 0x2ab60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ab6550>, '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': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', '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 07:20:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 07:20:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 07:20:31 INFO - Using env: {'DISPLAY': ':0', 07:20:31 INFO - 'HOME': '/home/cltbld', 07:20:31 INFO - 'LANG': 'en_US.UTF-8', 07:20:31 INFO - 'LANGUAGE': 'en_US:en', 07:20:31 INFO - 'LOGNAME': 'cltbld', 07:20:31 INFO - 'MAIL': '/var/mail/cltbld', 07:20:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:31 INFO - 'MOZ_NO_REMOTE': '1', 07:20:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:31 INFO - 'NO_EM_RESTART': '1', 07:20:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:20:31 INFO - 'PWD': '/builds/slave/test', 07:20:31 INFO - 'SHELL': '/bin/bash', 07:20:31 INFO - 'SHLVL': '1', 07:20:31 INFO - 'TERM': 'linux', 07:20:31 INFO - 'TMOUT': '86400', 07:20:31 INFO - 'USER': 'cltbld', 07:20:31 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', 07:20:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:31 INFO - '_': '/tools/buildbot/bin/python'} 07:20:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:31 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 07:20:31 INFO - Cleaning up... 07:20:32 INFO - Return code: 0 07:20:32 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 07:20:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:32 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 0x7fe303911f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x295b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a26350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ab51c0>, '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 0x2ab60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ab6550>, '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': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', '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 07:20:32 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 07:20:32 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 07:20:32 INFO - Using env: {'DISPLAY': ':0', 07:20:32 INFO - 'HOME': '/home/cltbld', 07:20:32 INFO - 'LANG': 'en_US.UTF-8', 07:20:32 INFO - 'LANGUAGE': 'en_US:en', 07:20:32 INFO - 'LOGNAME': 'cltbld', 07:20:32 INFO - 'MAIL': '/var/mail/cltbld', 07:20:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:32 INFO - 'MOZ_NO_REMOTE': '1', 07:20:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:32 INFO - 'NO_EM_RESTART': '1', 07:20:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:20:32 INFO - 'PWD': '/builds/slave/test', 07:20:32 INFO - 'SHELL': '/bin/bash', 07:20:32 INFO - 'SHLVL': '1', 07:20:32 INFO - 'TERM': 'linux', 07:20:32 INFO - 'TMOUT': '86400', 07:20:32 INFO - 'USER': 'cltbld', 07:20:32 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', 07:20:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:32 INFO - '_': '/tools/buildbot/bin/python'} 07:20:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:32 INFO - Downloading/unpacking psutil>=3.1.1 07:20:32 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 07:20:32 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 07:20:32 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 07:20:32 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 07:20:32 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 07:20:32 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 07:20:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 07:20:34 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:20:34 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:20:34 INFO - Installing collected packages: psutil 07:20:34 INFO - Running setup.py install for psutil 07:20:34 INFO - building 'psutil._psutil_linux' extension 07:20:34 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 07:20:34 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 07:20:34 INFO - building 'psutil._psutil_posix' extension 07:20:34 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 07:20:34 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 07:20:34 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:20:34 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:20:34 INFO - Successfully installed psutil 07:20:34 INFO - Cleaning up... 07:20:34 INFO - Return code: 0 07:20:34 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 07:20:34 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')]} 07:20:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:34 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')]} 07:20:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:34 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 0x7fe303911f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x295b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a26350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ab51c0>, '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 0x2ab60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ab6550>, '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': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', '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 07:20:34 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 07:20:34 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 07:20:34 INFO - Using env: {'DISPLAY': ':0', 07:20:34 INFO - 'HOME': '/home/cltbld', 07:20:34 INFO - 'LANG': 'en_US.UTF-8', 07:20:34 INFO - 'LANGUAGE': 'en_US:en', 07:20:34 INFO - 'LOGNAME': 'cltbld', 07:20:34 INFO - 'MAIL': '/var/mail/cltbld', 07:20:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:34 INFO - 'MOZ_NO_REMOTE': '1', 07:20:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:34 INFO - 'NO_EM_RESTART': '1', 07:20:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:20:34 INFO - 'PWD': '/builds/slave/test', 07:20:34 INFO - 'SHELL': '/bin/bash', 07:20:34 INFO - 'SHLVL': '1', 07:20:34 INFO - 'TERM': 'linux', 07:20:34 INFO - 'TMOUT': '86400', 07:20:34 INFO - 'USER': 'cltbld', 07:20:34 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', 07:20:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:34 INFO - '_': '/tools/buildbot/bin/python'} 07:20:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:34 INFO - Downloading/unpacking mozsystemmonitor==0.3 07:20:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:36 INFO - Downloading mozsystemmonitor-0.3.tar.gz 07:20:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:20:36 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 07:20:36 INFO - Installing collected packages: mozsystemmonitor 07:20:36 INFO - Running setup.py install for mozsystemmonitor 07:20:37 INFO - Successfully installed mozsystemmonitor 07:20:37 INFO - Cleaning up... 07:20:37 INFO - Return code: 0 07:20:37 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 07:20:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fe303911f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x295b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a26350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ab51c0>, '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 0x2ab60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ab6550>, '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': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', '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 07:20:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 07:20:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 07:20:37 INFO - Using env: {'DISPLAY': ':0', 07:20:37 INFO - 'HOME': '/home/cltbld', 07:20:37 INFO - 'LANG': 'en_US.UTF-8', 07:20:37 INFO - 'LANGUAGE': 'en_US:en', 07:20:37 INFO - 'LOGNAME': 'cltbld', 07:20:37 INFO - 'MAIL': '/var/mail/cltbld', 07:20:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:37 INFO - 'MOZ_NO_REMOTE': '1', 07:20:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:37 INFO - 'NO_EM_RESTART': '1', 07:20:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:20:37 INFO - 'PWD': '/builds/slave/test', 07:20:37 INFO - 'SHELL': '/bin/bash', 07:20:37 INFO - 'SHLVL': '1', 07:20:37 INFO - 'TERM': 'linux', 07:20:37 INFO - 'TMOUT': '86400', 07:20:37 INFO - 'USER': 'cltbld', 07:20:37 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', 07:20:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:37 INFO - '_': '/tools/buildbot/bin/python'} 07:20:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:37 INFO - Downloading/unpacking jsonschema==2.5.1 07:20:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:39 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:20:39 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 07:20:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:39 INFO - Downloading functools32-3.2.3-2.tar.gz 07:20:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 07:20:39 INFO - warning: no files found matching '*.txt' 07:20:39 INFO - no previously-included directories found matching 'build' 07:20:39 INFO - no previously-included directories found matching 'dist' 07:20:39 INFO - no previously-included directories found matching '.git*' 07:20:39 INFO - Installing collected packages: jsonschema, functools32 07:20:39 INFO - Running setup.py install for functools32 07:20:39 INFO - warning: no files found matching '*.txt' 07:20:39 INFO - no previously-included directories found matching 'build' 07:20:39 INFO - no previously-included directories found matching 'dist' 07:20:39 INFO - no previously-included directories found matching '.git*' 07:20:39 INFO - Successfully installed jsonschema functools32 07:20:39 INFO - Cleaning up... 07:20:39 INFO - Return code: 0 07:20:39 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 07:20:39 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')]} 07:20:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:39 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')]} 07:20:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:39 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 0x7fe303911f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x295b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a26350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ab51c0>, '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 0x2ab60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ab6550>, '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': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', '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 07:20:39 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 07:20:39 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 07:20:39 INFO - Using env: {'DISPLAY': ':0', 07:20:39 INFO - 'HOME': '/home/cltbld', 07:20:39 INFO - 'LANG': 'en_US.UTF-8', 07:20:39 INFO - 'LANGUAGE': 'en_US:en', 07:20:39 INFO - 'LOGNAME': 'cltbld', 07:20:39 INFO - 'MAIL': '/var/mail/cltbld', 07:20:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:39 INFO - 'MOZ_NO_REMOTE': '1', 07:20:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:39 INFO - 'NO_EM_RESTART': '1', 07:20:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:20:39 INFO - 'PWD': '/builds/slave/test', 07:20:39 INFO - 'SHELL': '/bin/bash', 07:20:39 INFO - 'SHLVL': '1', 07:20:39 INFO - 'TERM': 'linux', 07:20:39 INFO - 'TMOUT': '86400', 07:20:39 INFO - 'USER': 'cltbld', 07:20:39 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', 07:20:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:39 INFO - '_': '/tools/buildbot/bin/python'} 07:20:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:39 INFO - Downloading/unpacking blobuploader==1.2.4 07:20:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:41 INFO - Downloading blobuploader-1.2.4.tar.gz 07:20:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:20:41 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:20:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 07:20:42 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:20:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:42 INFO - Downloading docopt-0.6.1.tar.gz 07:20:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 07:20:42 INFO - Installing collected packages: blobuploader, requests, docopt 07:20:42 INFO - Running setup.py install for blobuploader 07:20:42 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:20:42 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 07:20:42 INFO - Running setup.py install for requests 07:20:43 INFO - Running setup.py install for docopt 07:20:43 INFO - Successfully installed blobuploader requests docopt 07:20:43 INFO - Cleaning up... 07:20:43 INFO - Return code: 0 07:20:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:20:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:20:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:43 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 0x7fe303911f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x295b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a26350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ab51c0>, '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 0x2ab60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ab6550>, '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': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', '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 07:20:43 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 07:20:43 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 07:20:43 INFO - Using env: {'DISPLAY': ':0', 07:20:43 INFO - 'HOME': '/home/cltbld', 07:20:43 INFO - 'LANG': 'en_US.UTF-8', 07:20:43 INFO - 'LANGUAGE': 'en_US:en', 07:20:43 INFO - 'LOGNAME': 'cltbld', 07:20:43 INFO - 'MAIL': '/var/mail/cltbld', 07:20:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:43 INFO - 'MOZ_NO_REMOTE': '1', 07:20:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:43 INFO - 'NO_EM_RESTART': '1', 07:20:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:20:43 INFO - 'PWD': '/builds/slave/test', 07:20:43 INFO - 'SHELL': '/bin/bash', 07:20:43 INFO - 'SHLVL': '1', 07:20:43 INFO - 'TERM': 'linux', 07:20:43 INFO - 'TMOUT': '86400', 07:20:43 INFO - 'USER': 'cltbld', 07:20:43 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', 07:20:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:43 INFO - '_': '/tools/buildbot/bin/python'} 07:20:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:20:43 INFO - Running setup.py (path:/tmp/pip-oy7yI9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:20:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:20:43 INFO - Running setup.py (path:/tmp/pip-VoBB6Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:20:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:20:43 INFO - Running setup.py (path:/tmp/pip-hHTJac-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:20:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:20:43 INFO - Running setup.py (path:/tmp/pip-y4GB0r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:20:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:20:43 INFO - Running setup.py (path:/tmp/pip-gh8cEg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:20:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:20:43 INFO - Running setup.py (path:/tmp/pip-uvVvd8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:20:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:20:43 INFO - Running setup.py (path:/tmp/pip-LcBtdA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:20:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:20:43 INFO - Running setup.py (path:/tmp/pip-LFdZEV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:20:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:20:43 INFO - Running setup.py (path:/tmp/pip-FNbjHH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:20:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:20:44 INFO - Running setup.py (path:/tmp/pip-8M_SmI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:20:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:20:44 INFO - Running setup.py (path:/tmp/pip-1WDeIT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:20:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:20:44 INFO - Running setup.py (path:/tmp/pip-MOxrVd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:20:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:20:44 INFO - Running setup.py (path:/tmp/pip-PXKYKw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:20:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:20:44 INFO - Running setup.py (path:/tmp/pip-kTDSJC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:20:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:20:44 INFO - Running setup.py (path:/tmp/pip-M4tKcR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:20:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:20:44 INFO - Running setup.py (path:/tmp/pip-UCqjQ7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:20:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:20:44 INFO - Running setup.py (path:/tmp/pip-em0Ipq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:20:44 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:20:44 INFO - Running setup.py install for manifestparser 07:20:44 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 07:20:44 INFO - Running setup.py install for mozcrash 07:20:44 INFO - Running setup.py install for mozdebug 07:20:44 INFO - Running setup.py install for mozdevice 07:20:45 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Installing dm script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Running setup.py install for mozfile 07:20:45 INFO - Running setup.py install for mozhttpd 07:20:45 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Running setup.py install for mozinfo 07:20:45 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Running setup.py install for mozInstall 07:20:45 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Running setup.py install for mozleak 07:20:45 INFO - Running setup.py install for mozlog 07:20:45 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Running setup.py install for moznetwork 07:20:45 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Running setup.py install for mozprocess 07:20:45 INFO - Running setup.py install for mozprofile 07:20:45 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 07:20:45 INFO - Running setup.py install for mozrunner 07:20:46 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 07:20:46 INFO - Running setup.py install for mozscreenshot 07:20:46 INFO - Running setup.py install for moztest 07:20:46 INFO - Running setup.py install for mozversion 07:20:46 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 07:20:46 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:20:46 INFO - Cleaning up... 07:20:46 INFO - Return code: 0 07:20:46 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:20: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')]} 07:20:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20: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')]} 07:20:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:46 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 0x7fe303911f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x295b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a26350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ab51c0>, '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 0x2ab60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ab6550>, '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': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', '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 07:20:46 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 07:20:46 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 07:20:46 INFO - Using env: {'DISPLAY': ':0', 07:20:46 INFO - 'HOME': '/home/cltbld', 07:20:46 INFO - 'LANG': 'en_US.UTF-8', 07:20:46 INFO - 'LANGUAGE': 'en_US:en', 07:20:46 INFO - 'LOGNAME': 'cltbld', 07:20:46 INFO - 'MAIL': '/var/mail/cltbld', 07:20:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:46 INFO - 'MOZ_NO_REMOTE': '1', 07:20:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:46 INFO - 'NO_EM_RESTART': '1', 07:20:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:20:46 INFO - 'PWD': '/builds/slave/test', 07:20:46 INFO - 'SHELL': '/bin/bash', 07:20:46 INFO - 'SHLVL': '1', 07:20:46 INFO - 'TERM': 'linux', 07:20:46 INFO - 'TMOUT': '86400', 07:20:46 INFO - 'USER': 'cltbld', 07:20:46 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', 07:20:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:46 INFO - '_': '/tools/buildbot/bin/python'} 07:20:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:20:46 INFO - Running setup.py (path:/tmp/pip-ZdcD6V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:20:46 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)) 07:20:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:20:46 INFO - Running setup.py (path:/tmp/pip-2V6QKX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:20:46 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)) 07:20:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:20:46 INFO - Running setup.py (path:/tmp/pip-yOba5i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:20:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 07:20:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:20:46 INFO - Running setup.py (path:/tmp/pip-6Ubqx5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:20:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:20:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:20:46 INFO - Running setup.py (path:/tmp/pip-wPDAy8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:20:47 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)) 07:20:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:20:47 INFO - Running setup.py (path:/tmp/pip-RnvRtu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:20:47 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)) 07:20:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:20:47 INFO - Running setup.py (path:/tmp/pip-SP0ThE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:20:47 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)) 07:20:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:20:47 INFO - Running setup.py (path:/tmp/pip-sxsaY9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:20:47 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)) 07:20:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:20:47 INFO - Running setup.py (path:/tmp/pip-EmcMN6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:20:47 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)) 07:20:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:20:47 INFO - Running setup.py (path:/tmp/pip-rzl1x6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:20:47 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)) 07:20:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:20:47 INFO - Running setup.py (path:/tmp/pip-Jx8qyi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:20:47 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)) 07:20:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:20:47 INFO - Running setup.py (path:/tmp/pip-6AvXgz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:20:47 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)) 07:20:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:20:47 INFO - Running setup.py (path:/tmp/pip-7HIIY4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:20:47 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)) 07:20:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:20:47 INFO - Running setup.py (path:/tmp/pip-hHb6MP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:20:47 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)) 07:20:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:20:47 INFO - Running setup.py (path:/tmp/pip-UgDFv_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:20:47 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)) 07:20:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:20:47 INFO - Running setup.py (path:/tmp/pip-fTw8ee-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:20:47 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 07:20:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:20:47 INFO - Running setup.py (path:/tmp/pip-s6G27p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:20:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 07:20:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:20:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:20:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 07:20:47 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:20:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 07:20:47 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:20:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:49 INFO - Downloading blessings-1.6.tar.gz 07:20:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 07:20:49 INFO - Installing collected packages: blessings 07:20:49 INFO - Running setup.py install for blessings 07:20:49 INFO - Successfully installed blessings 07:20:49 INFO - Cleaning up... 07:20:50 INFO - Return code: 0 07:20:50 INFO - Done creating virtualenv /builds/slave/test/build/venv. 07:20:50 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:20:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:20:50 INFO - Reading from file tmpfile_stdout 07:20:50 INFO - Current package versions: 07:20:50 INFO - argparse == 1.2.1 07:20:50 INFO - blessings == 1.6 07:20:50 INFO - blobuploader == 1.2.4 07:20:50 INFO - docopt == 0.6.1 07:20:50 INFO - functools32 == 3.2.3-2 07:20:50 INFO - jsonschema == 2.5.1 07:20:50 INFO - manifestparser == 1.1 07:20:50 INFO - mozInstall == 1.12 07:20:50 INFO - mozcrash == 0.17 07:20:50 INFO - mozdebug == 0.1 07:20:50 INFO - mozdevice == 0.48 07:20:50 INFO - mozfile == 1.2 07:20:50 INFO - mozhttpd == 0.7 07:20:50 INFO - mozinfo == 0.9 07:20:50 INFO - mozleak == 0.1 07:20:50 INFO - mozlog == 3.2 07:20:50 INFO - moznetwork == 0.27 07:20:50 INFO - mozprocess == 0.22 07:20:50 INFO - mozprofile == 0.28 07:20:50 INFO - mozrunner == 6.11 07:20:50 INFO - mozscreenshot == 0.1 07:20:50 INFO - mozsystemmonitor == 0.3 07:20:50 INFO - moztest == 0.7 07:20:50 INFO - mozversion == 1.4 07:20:50 INFO - psutil == 3.1.1 07:20:50 INFO - requests == 1.2.3 07:20:50 INFO - wsgiref == 0.1.2 07:20:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:20: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')]} 07:20:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20: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')]} 07:20:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:50 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 0x7fe303911f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x295b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a26350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ab51c0>, '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 0x2ab60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ab6550>, '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': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', '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 07:20:50 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 07:20:50 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 07:20:50 INFO - Using env: {'DISPLAY': ':0', 07:20:50 INFO - 'HOME': '/home/cltbld', 07:20:50 INFO - 'LANG': 'en_US.UTF-8', 07:20:50 INFO - 'LANGUAGE': 'en_US:en', 07:20:50 INFO - 'LOGNAME': 'cltbld', 07:20:50 INFO - 'MAIL': '/var/mail/cltbld', 07:20:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:50 INFO - 'MOZ_NO_REMOTE': '1', 07:20:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:50 INFO - 'NO_EM_RESTART': '1', 07:20:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:20:50 INFO - 'PWD': '/builds/slave/test', 07:20:50 INFO - 'SHELL': '/bin/bash', 07:20:50 INFO - 'SHLVL': '1', 07:20:50 INFO - 'TERM': 'linux', 07:20:50 INFO - 'TMOUT': '86400', 07:20:50 INFO - 'USER': 'cltbld', 07:20:50 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', 07:20:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:50 INFO - '_': '/tools/buildbot/bin/python'} 07:20:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:50 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)) 07:20:50 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)) 07:20:50 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)) 07:20:50 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)) 07:20:50 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)) 07:20:50 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)) 07:20:50 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)) 07:20:50 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)) 07:20:50 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)) 07:20:50 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)) 07:20:50 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)) 07:20:50 INFO - Cleaning up... 07:20:50 INFO - Return code: 0 07:20:50 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 07:20: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')]} 07:20:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20: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')]} 07:20:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:50 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 0x7fe303911f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x295b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a26350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ab51c0>, '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 0x2ab60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ab6550>, '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': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', '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 07:20:50 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 07:20:50 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 07:20:50 INFO - Using env: {'DISPLAY': ':0', 07:20:50 INFO - 'HOME': '/home/cltbld', 07:20:50 INFO - 'LANG': 'en_US.UTF-8', 07:20:50 INFO - 'LANGUAGE': 'en_US:en', 07:20:50 INFO - 'LOGNAME': 'cltbld', 07:20:50 INFO - 'MAIL': '/var/mail/cltbld', 07:20:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:50 INFO - 'MOZ_NO_REMOTE': '1', 07:20:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:50 INFO - 'NO_EM_RESTART': '1', 07:20:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:20:50 INFO - 'PWD': '/builds/slave/test', 07:20:50 INFO - 'SHELL': '/bin/bash', 07:20:50 INFO - 'SHLVL': '1', 07:20:50 INFO - 'TERM': 'linux', 07:20:50 INFO - 'TMOUT': '86400', 07:20:50 INFO - 'USER': 'cltbld', 07:20:50 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', 07:20:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:50 INFO - '_': '/tools/buildbot/bin/python'} 07:20:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:50 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 07:20:50 INFO - Cleaning up... 07:20:50 INFO - Return code: 0 07:20:50 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 07:20: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')]} 07:20:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:20:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20: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')]} 07:20:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:20:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:20:50 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 0x7fe303911f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x295b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a26350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2ab51c0>, '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 0x2ab60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ab6550>, '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': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', '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 07:20:50 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 07:20:50 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 07:20:50 INFO - Using env: {'DISPLAY': ':0', 07:20:50 INFO - 'HOME': '/home/cltbld', 07:20:50 INFO - 'LANG': 'en_US.UTF-8', 07:20:50 INFO - 'LANGUAGE': 'en_US:en', 07:20:50 INFO - 'LOGNAME': 'cltbld', 07:20:50 INFO - 'MAIL': '/var/mail/cltbld', 07:20:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:20:50 INFO - 'MOZ_NO_REMOTE': '1', 07:20:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:20:50 INFO - 'NO_EM_RESTART': '1', 07:20:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:20:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:20:50 INFO - 'PWD': '/builds/slave/test', 07:20:50 INFO - 'SHELL': '/bin/bash', 07:20:50 INFO - 'SHLVL': '1', 07:20:50 INFO - 'TERM': 'linux', 07:20:50 INFO - 'TMOUT': '86400', 07:20:50 INFO - 'USER': 'cltbld', 07:20:50 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', 07:20:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:20:50 INFO - '_': '/tools/buildbot/bin/python'} 07:20:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:20:50 INFO - Downloading/unpacking flake8 07:20:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:52 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 07:20:52 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 07:20:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:53 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 07:20:53 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 07:20:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:53 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 07:20:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:20:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:20:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:20:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 07:20:53 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:20:53 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:20:53 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:20:53 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:20:53 INFO - no previously-included directories found matching 'docs/_build' 07:20:53 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 07:20:53 INFO - Running setup.py install for pep8 07:20:53 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:20:53 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:20:53 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:20:53 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:20:53 INFO - no previously-included directories found matching 'docs/_build' 07:20:53 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 07:20:53 INFO - Successfully installed flake8 mccabe pyflakes pep8 07:20:53 INFO - Cleaning up... 07:20:53 INFO - Return code: 0 07:20:53 INFO - Running post-action listener: _resource_record_post_action 07:20:53 INFO - Running post-action listener: _start_resource_monitoring 07:20:53 INFO - Starting resource monitoring. 07:20:53 INFO - ##### 07:20:53 INFO - ##### Finished create-virtualenv step (success) 07:20:53 INFO - ##### 07:20:53 INFO - ##### 07:20:53 INFO - ##### Running install step. 07:20:53 INFO - ##### 07:20:53 INFO - Running pre-action listener: _resource_record_pre_action 07:20:53 INFO - Running main action method: install 07:20:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:20:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:20:54 INFO - Reading from file tmpfile_stdout 07:20:54 INFO - Detecting whether we're running mozinstall >=1.0... 07:20:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 07:20:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 07:20:54 INFO - Reading from file tmpfile_stdout 07:20:54 INFO - Output received: 07:20:54 INFO - Usage: mozinstall [options] installer 07:20:54 INFO - Options: 07:20:54 INFO - -h, --help show this help message and exit 07:20:54 INFO - -d DEST, --destination=DEST 07:20:54 INFO - Directory to install application into. [default: 07:20:54 INFO - "/builds/slave/test"] 07:20:54 INFO - --app=APP Application being installed. [default: firefox] 07:20:54 INFO - mkdir: /builds/slave/test/build/application 07:20:54 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'] 07:20:54 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 07:21:11 INFO - Reading from file tmpfile_stdout 07:21:11 INFO - Output received: 07:21:11 INFO - /builds/slave/test/build/application/firefox/firefox 07:21:11 INFO - Running post-action listener: _resource_record_post_action 07:21:11 INFO - ##### 07:21:11 INFO - ##### Finished install step (success) 07:21:11 INFO - ##### 07:21:11 INFO - ##### 07:21:11 INFO - ##### Running run-tests step. 07:21:11 INFO - ##### 07:21:11 INFO - Running pre-action listener: _resource_record_pre_action 07:21:11 INFO - Running main action method: run_tests 07:21:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 07:21:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 07:21:11 INFO - Python 2.7.3 07:21:11 INFO - Return code: 0 07:21:11 INFO - grabbing minidump binary from tooltool 07:21:11 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')]} 07:21:11 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 0x2ab51c0>, '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 0x2ab60c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ab6550>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 07:21:11 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 07:21:11 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 07:21:11 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 07:21:11 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:21:11 INFO - Return code: 0 07:21:11 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 07:21:11 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 07:21:11 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 07:21:11 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 07:21:11 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 07:21:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 07:21:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 07:21:12 INFO - Return code: 0 07:21:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-068', '--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 07:21:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-068 --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 07:21:12 INFO - Using env: {'DISPLAY': ':0', 07:21:12 INFO - 'HOME': '/home/cltbld', 07:21:12 INFO - 'LANG': 'en_US.UTF-8', 07:21:12 INFO - 'LANGUAGE': 'en_US:en', 07:21:12 INFO - 'LOGNAME': 'cltbld', 07:21:12 INFO - 'MAIL': '/var/mail/cltbld', 07:21:12 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 07:21:12 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 07:21:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:21:12 INFO - 'MOZ_NO_REMOTE': '1', 07:21:12 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 07:21:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:21:12 INFO - 'NO_EM_RESTART': '1', 07:21:12 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:21:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:21:12 INFO - 'PWD': '/builds/slave/test', 07:21:12 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 07:21:12 INFO - 'SHELL': '/bin/bash', 07:21:12 INFO - 'SHLVL': '1', 07:21:12 INFO - 'TERM': 'linux', 07:21:12 INFO - 'TMOUT': '86400', 07:21:12 INFO - 'USER': 'cltbld', 07:21:12 INFO - 'XDG_SESSION_COOKIE': '97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700', 07:21:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:21:12 INFO - '_': '/tools/buildbot/bin/python'} 07:21:12 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-068', '--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 07:21:12 INFO - mozversion application_buildid: 20160616043206 07:21:12 INFO - mozversion application_changeset: 44256084ae2e8a2777eeaf040f8bdb584a818ef8 07:21:12 INFO - mozversion application_display_name: Nightly 07:21:12 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:21:12 INFO - mozversion application_name: Firefox 07:21:12 INFO - mozversion application_remotingname: firefox 07:21:12 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 07:21:12 INFO - mozversion application_vendor: Mozilla 07:21:12 INFO - mozversion application_version: 50.0a1 07:21:12 INFO - mozversion platform_buildid: 20160616043206 07:21:12 INFO - mozversion platform_changeset: 44256084ae2e8a2777eeaf040f8bdb584a818ef8 07:21:12 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 07:21:12 INFO - mozversion platform_version: 50.0a1 07:21:12 INFO - using testdate: 1466086872 07:21:12 INFO - actual date: 1466086872 07:21:12 INFO - starting webserver on 'localhost:56579' 07:21:12 INFO - SUITE-START | Running 2 tests 07:21:12 INFO - TEST-START | dromaeo_css 07:21:12 INFO - operating with platform_type : linux_ 07:21:12 INFO - Initialising browser for dromaeo_css test... 07:21:12 INFO - TEST-INFO | started process 3811 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpR5JgWH/profile http://localhost:56579/getInfo.html) 07:21:17 INFO - PROCESS | 3811 | __metrics Screen width/height:1600/1200 07:21:17 INFO - PROCESS | 3811 | colorDepth:24 07:21:17 INFO - PROCESS | 3811 | Browser inner width/height: 1024/697 07:21:17 INFO - PROCESS | 3811 | __metrics 07:21:17 ERROR - PROCESS | 3811 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2947: TypeError: this.tabs is undefined 07:21:18 INFO - TEST-INFO | 3811: exit 0 07:21:18 INFO - Browser initialized. 07:21:18 INFO - Running cycle 1/1 for dromaeo_css test... 07:21:18 INFO - TEST-INFO | started process 3932 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpR5JgWH/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:21:30 INFO - PROCESS | 3932 | RSS: Main: 184684544 07:21:30 INFO - PROCESS | 3932 | 07:22:20 INFO - PROCESS | 3932 | 1466086940356 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] 07:24:28 INFO - PROCESS | 3932 | Cycle 1(1): loaded http://localhost:56579/tests/dromaeo/cssquery-dojo.html (next: http://localhost:56579/tests/dromaeo/cssquery-ext.html) 07:24:29 INFO - PROCESS | 3932 | RSS: Main: 188895232 07:24:29 INFO - PROCESS | 3932 | 07:27:31 INFO - PROCESS | 3932 | Cycle 1(1): loaded http://localhost:56579/tests/dromaeo/cssquery-ext.html (next: http://localhost:56579/tests/dromaeo/cssquery-jquery.html) 07:27:32 INFO - PROCESS | 3932 | RSS: Main: 187543552 07:27:32 INFO - PROCESS | 3932 | 07:30:34 INFO - PROCESS | 3932 | Cycle 1(1): loaded http://localhost:56579/tests/dromaeo/cssquery-jquery.html (next: http://localhost:56579/tests/dromaeo/cssquery-mootools.html) 07:30:35 INFO - PROCESS | 3932 | RSS: Main: 189640704 07:30:35 INFO - PROCESS | 3932 | 07:33:36 INFO - PROCESS | 3932 | Cycle 1(1): loaded http://localhost:56579/tests/dromaeo/cssquery-mootools.html (next: http://localhost:56579/tests/dromaeo/cssquery-prototype.html) 07:33:37 INFO - PROCESS | 3932 | RSS: Main: 186540032 07:33:37 INFO - PROCESS | 3932 | 07:36:39 INFO - PROCESS | 3932 | Cycle 1(1): loaded http://localhost:56579/tests/dromaeo/cssquery-prototype.html (next: http://localhost:56579/tests/dromaeo/cssquery-yui.html) 07:36:40 INFO - PROCESS | 3932 | RSS: Main: 188596224 07:36:40 INFO - PROCESS | 3932 | 07:39:43 INFO - PROCESS | 3932 | Cycle 1(1): loaded http://localhost:56579/tests/dromaeo/cssquery-yui.html (next: http://localhost:56579/tests/dromaeo/cssquery-dojo.html) 07:39:43 INFO - PROCESS | 3932 | RSS: Main: 190083072 07:39:43 INFO - PROCESS | 3932 | 07:39:43 INFO - PROCESS | 3932 | __start_tp_report 07:39:43 INFO - PROCESS | 3932 | _x_x_mozilla_page_load 07:39:43 INFO - PROCESS | 3932 | _x_x_mozilla_page_load_details 07:39:43 INFO - PROCESS | 3932 | |i|pagename|runs| 07:39:43 INFO - PROCESS | 3932 | |0;dojo.html;3120.469520181569;3141.3089120393506;3174.9365012699745;3178.046586024192;3183.9681603183976;5468.699221542814;5476.808311709091;5564.527015203707;5585.078462053766;5590.049691552435;5365.839024829262;5445.591580631449;5454.181872719094;5454.563634909207;5543.279373681416;4890.21756518957;4911.950880491185;5034.622403319766;5080.110980578384;5117.948820511803;830.5477645009674;4943.752812359386;4989.426215985171;5060.215666571669;5099.464556221599;5011.799528018893;5015.5736762375245;5018.2974383586325;5033.949660503421;5054.7472626368535;5061.873453163664;5062.1141300272675;5065.848024559269;5078.035173317058;5098.923516147261;4990.326305948687;5023.874403139951;5042.193249080129;5043.823466178703;5087.109755792721;5559.054960656698;5567.526760225385;5577.135543990647;5590.91613625796;5596.356419011825;5780.682062486561;5814.97092514539;5822.883542329129;5876.559258055663;5933.406659334075;6004.159417681528;6004.459598636144;6017.548683848685;6038.698065096728;6115.48018418435;5545.223668686387;5550.833474995757;5558.805441809558;5559.054960656698;5560.360558535739;5911.142884281755;5999.100134979701;6045.0327947528185;6058.848528786727;6061.363556826558;5811.535077193815;5814.3313518945015;5815.156802263648;5815.563832712563;5855.531557475391;5993.580449368503;5998.400159983967;6000.489958353502;6005.369436209223;6015.127806468037;5679.261695979579;5693.032184528557;5726.828195154152;5735.082386818089;5967.433093856077;5693.572982026365;5698.857528561819;5705.343885453226;5780.1907732917425;5789.507891829157;4282.76444795533;4365.126974605028;4372.912541749147;4384.342348647729;4396.010897548026;3928.3910993796007;4005.2590270799997;4037.555868854424;4057.89855253621;4065.6747460203114;5523.502884740393;5647.435256474402;5655.915161272585;5670.943290567124;5678.4037676044245;5902.321233058254;5937;5958.165856780054;5989.101634754822;5998.970005149947;5639.746211420496;5678.716064196774;5679.914801277984;5680.375158732536;5690.5447564194765;4901.460839307673;4931.87670308238;4948.826791062295;4958.933829226734;4984.077945580079;6121.510279177655;6141.877162456815;6155.938440615626;6162.352952939967;6171.6297022178815;5825.912611310919;5846.386129456346;5957.880842383128;5963.821085367446;5970.5522085844605;6024.186734790923;6063;6098.311206366174;6118.326984031664;6166.167567378347;5832.096025116114;5841.269841269841;5866.67733274674;5872.882542349043;5912.526997840077;5852.736626851887;5977.073553599199;5981.461668449861;6000.549958753024;6000.87998240024;5737.942620573741;5788.7395067222915;5796.072628379439;5850.063989761617;5850.444207800252;5715.171300161536;5718.056520674042;5746;5755.71221438918;5783.103618939072;5592.804251851166;5687.232223649754;5702.657840529581;5716.9428305718075;5729.054705973635;5826.126081087871;5900.527957763283;5913.526917846648;5925.288965324189;5945.227120474311;5777.971110144423;5781.161731548986;5802.216700745515;5802.6808525531505;5815.2149459822385 07:39:43 INFO - PROCESS | 3932 | |1;ext.html;551.2007588995955;598.2999890128549;614.6342925959054;618.1593033474477;630.8139098965802;40092.59907400925;41661.375079373836;41990.37014444786;42006;43643.78178109113;42591.57408425915;42945.141097178035;43057.569424305824;43134.352984705256;43207.56792432075;8968.372213945026;8999.235065019448;9028;9041.14109159632;9118.680846170386;8856.070112638177;8990.730278091634;9006.59470323837;9011.909880901172;9038.412503187305;9004.729858104234;9015.188633023026;9053.637854485845;9060.229880460169;9067.95466022669;8864.512451815148;8869.467831930073;8924.910750892506;9035.909640903637;9036.593353299051;8876.378653494257;8902.955485222597;8923.063078376741;8962.283017358595;8987.910120898772;40118.799406003076;40534.39198412026;40557.14707102821;40665.18669626591;40699.59300407017;3570.7500474966764;3695.4456831475227;3773.8867833965023;4152.771597562133;4344.348347747863;31506.212344691336;32013.519797203062;32177.1955701107;32301.676983230103;33385;4008;4171.270027745132;4345.9130817383475;4383.211022016036;4403.097365040159;332250;332668;333599;334303;334475;32939.01182964467;59369.40630593639;59571.404285957455;59924;60197;33658.8317058418;35347.4697879532;35468.82265588656;35503.64496355003;35546.46680299797;15035.54893353201;15143.772843407358;15151.090934543963;15238.847611523743;15246.923765381323;12485.313307767978;12582.685432864251;12588.874111258954;12613.054020948466;12677;8141.22658347456;8195.67217311301;8246.711365102192;8254.876176857351;8323.791905202419;3239.271163988084;3249.447593909041;3295;3338.6160591532284;3362.529245905575;988.9505524723735;1088.7604726960055;1120.9271397359146;1125.6229163230246;1135.335828540313;30866.69133308683;31446.37107257842;31520.842395787873;32057.17812419115;32151.839240803645;1076.424113099488;1097.1497089755503;1117.871444783844;1131.185546406586;1140.8402823604702;16663.416780412626;16970.915145424442;17355.56611084733;17385.82614173842;18049.187786549635;567399;576520;577916;578283;579313;57592.71203643955;58405.70797145987;58749.706251468466;58777.70611147003;58899.70550147222;1272;1342.335543905773;1343.4559003603556;1357.5384369314284;1377.8622137786342;31176.220594484414;32191.51712724358;32478.83760581182;32582;32723.55098025592;49169.26246106383;49984.500154997986;50137;50427.49572504228;50475.49524504708;480799;482876;482929;482967;485344;27705.307367315978;27751.583726244527;28224;28239.29401764972;28358.85820570884;46731;47404.288935666686;47500.52499474961;47649.52350476451;48079;40372.98311818184;40681.79659101686;41161.176776464905;41163.794181028905;41511.7924410376;39571.406428903014;40104.946030605424;40387;40405.595944040186;40553.391699123946;40086.1982760349;40602.1879562413;41231.1753764929;41379.7931010343;44667.776661116484;34755.65244347524;37744;37779.81110094432;38087.80956095202;38605.4209186868;28071.57892631653;28207;28341.858290708413;28800.135995920155;28923.855380722962 07:39:43 INFO - PROCESS | 3932 | |2;jquery.html;383.2105861924436;384.8383678854879;389.76419266343856;393.5684195953562;410.63248392688547;13599.864001359983;17903.910480447597;18602.813971860276;19242.13410396532;19278.807211927877;15026.17356045417;15704.450344237954;16891.91554042228;17675.20461579229;17815.73276400855;4903;5232.843014709546;5238.973805130969;5239.764210610512;5243.973780131113;5035.370578677665;5133.255677926699;5166.767495462713;5177.197534382177;5180.818671346504;5188.118019936601;5207.895842083156;5217.608679349045;5315.309009828717;5315.388730296007;5275.182346736243;5836.416358364151;5844.620099693507;5860.150278209636;5860.765569377241;5056.544910957995;5186.1442861927735;5188.870278243074;5191.32512773337;5198.766055527511;13888.513902013381;14741.189234592093;22248.666270005964;22808;22864.199753008565;2125.5005073807642;2278.7002895394457;2279.11114665279;2327.569399661051;2405.434722840131;10016.899831001743;10074.345167564084;10362.067413932782;10542.47287635615;14989.700205995929;1700.5408539694338;1755.95610109747;1883.2937648381858;1946.347973428903;1986.195590785734;75287;77765.61117194434;78020;78149.60925195452;78423;10906.563737450413;11084.279521831217;11189.272697274651;11241.943790280997;11273.21087523882;15245.923770381078;15255.847441525442;15315.15766632846;15368.308426120851;15415.075095494081;7231.927680723231;7502.2122677119205;7695.961520192363;7864.803379915548;7973.521588704696;7308.817279567947;7434;7459.776206713807;7461.626918654046;7569.750991086409;4773.71357718538;4787.114383839001;4798.2322828348;4799.160146974265;4842.709437433765;1807.9638407231782;1893.195391958412;1898.4684288399271;1965.508622844289;1978.6735188693704;983.090641156927;986.146982859821;1041.95832166714;1049.8661445638693;1064.1380481809604;19130.71303930442;19256.22975080981;19549.120289587;19737.40787776369;19997.800021999883;961.4087336288133;1008.2740426892772;1023.744063984004;1048.130052056791;1054.4569546683465;9693.158299922992;10962.835557466644;11020.669379918454;11065.50205240766;11117.22179447431;439156;441219;443545;453815.9638027161;456174;54176;58675.41324586785;84910;85596;88949.55525222461;964.286428043243;968.41894863083;997.6109317366233;1001.2540657210279;1001.3090967232732;16726.58183545421;16989.49031529056;16995;17138.31446742116;17527.912360438117;38577.421338680506;38908;39140.804295978334;40312.2189706313;40916.590834092465;54496.18255726088;55365.723171383885;55978.44021559732;56117;56724.432755673566;7618.6190690466365;7979.361651068017;8649.91350086491;8753.562321884008;8873.600687969187;13301.334933253105;13880.375383107583;13941.163530188222;13961.720765584429;14116.01187916836;11743.765124697287;11815.645530634094;12198;12252.142350035769;12435.316057616918;11559.768804623693;12119.75760484803;12231.877681223074;12289.324087175291;12493.187942784054;11635.941820290844;11694.941525292319;11827.231229970024;11837.408129593314;12085.939570302093;7876.8818467721885;8049.39629527776;8122.5126492410645;8206.425550211428;8239.258466738022;8855.291576673722;11265.943670281596;11699.23954942926;11905.642830715093;11964.820527692265 07:39:43 INFO - PROCESS | 3932 | |3;mootools.html;1442.3581506229725;1467.9486217982371;1551.2709026757427;1666.3251383189813;1684.1663376628571;7361.227071157518;7747.61261936903;7973.242541958519;8281.047679516858;8323.042850072243;8035.276825085741;8052.235037671427;8080.515169089844;8092.797680057986;8167.428280020401;2248.999999999996;2280.749117597063;2288.942776430586;2293.8738369389675;2295.1278514164596;2242.248846636379;2253.301476542269;2317.3974766560646;2325.5581439526522;2325.6976593042964;2285.988570057147;2301.5742087713825;2305.13557415969;2317.9420514487188;2321.9419514512188;2167.6098302305577;2169.7504786949467;2204.1293688992837;2211.1708109458955;2212.413710366754;2217.523232505019;2221.31139346803;2226.2096955580696;2227.8440509164366;2229.4092065602626;8392.370572207048;8405.243528082441;8409.159084091603;8426.78933026673;8454.154584541497;4930.506949305077;4936.358273424467;4966.528179822911;4974.054929563371;5087.771050302708;3143.779935404523;3240.983795081033;3400.7619466637343;3466.376052310583;3479.6346383629607;1072.7210925159436;1091.7052395853075;1096.0957210301533;1108.83921831334;1108.9944550277196;11474.541018359256;11534.307941523452;11573.42132893352;11581.36302503362;11611.709707257387;4321.200577893037;4370.956290437119;4377.518472967971;4455.086707225011;4472.843450479283;9627.663031793854;9640.325177237526;9651.324407291562;9668.806623867484;9676;4965.32968049316;4978.377702787152;4987.0524600325825;5006.899862002812;5036.345275114211;4120.876373708794;4505.6846020778885;4642.907141857211;4661.324108004321;4679.4618618858585;3765.6234376562124;3778.508793856836;3854.4411060396087;3870.4968354113785;3883.96116038836;1164.2432418927765;1201.3332600406684;1214.174361434233;1220.3837062283667;1228.3858070964518;845.9069502354736;863.7149740585592;881.9779505512414;914.5518695838991;930;5677.9211949729415;5702.258706368229;5725.341585717696;5849.1226316052935;5856.1508581255475;924.7595625137378;949.8765160529088;951.6478902806006;962.5427921737258;999.8200323941614;3894.746841455353;3908.4332771748504;3940.5074365704286;3961.8613348532663;3989.4813674222164;10018.599256029824;10417.531211095518;10434.16526677864;10444.321119127233;10446.582136714598;10043.949780251052;10206.081452669147;10282.331648442827;10309.690709278733;10386.32488888235;7661.693532258647;7728.845423091507;7780.18308077655;7784.610769461391;7794.337481314038;5262.184361423985;5349.331333583302;5458.91811622818;5489.1217405214975;5497.670139791625;9152.816943660957;9335.67325143644;9511.904880951102;9592.856107158537;9605.231581473325;9495.05049495045;9499.952500237454;9588.424694518351;9603.03969603062;9638.95180524093;6371.108044873814;6885;7069.540479868792;7418.258174182539;7786.065672119382;7782.610869456391;7892.0924093729955;7919.16848730875;7962.363010959225;7969;6797.966010169917;6971.7211311549;6989.720411183495;7034.437245020488;7254.746083887249;6897.7240910363025;6917.308269173042;6976.895346569704;7035.542689725152;7115.2528984455885;6596.208454985433;6647.567908085959;6670.66646667655;6674.632895190617;6696.062551242732;4924.926126108183;4967.180415231446;4967.677100988424;4976.054549635558;5043.823466178666;4892.339534162985;5106.361704786902;5150.639455238097;5169.327987361619;5234.476552344735 07:39:43 INFO - PROCESS | 3932 | |4;prototype.html;332.14331884764164;333.11723931581304;339.97497544902126;340.93863104641184;342.1122187922342;5606.299212598426;5669.319681638204;5707.172459993299;5717.714114294289;5718.428157184279;5549.36293793331;5559.638623489471;5579.246801681772;5587.832365029046;5604.719764011804;4153.563875793036;4199.7690127043;4292.012837047481;4338.544452832454;4342.869713908588;4294.613484786369;4302.97848510757;4327.697061205717;4329.480462344507;4329.631981281595;4291.098869237464;4332.675049371294;4363.978180109095;4374;4380.123975204956;4174.436451079111;4280.892977675552;4281.681696685078;4303.548127446636;4322.200392927319;3771.7741733936305;3772.2832661794173;3779.168582911755;3783.0895397823924;3787.1478917243676;5417.993013877296;5431.511163995259;5455.1271796512365;5475.890482190373;5490.396056433789;4895.485973972753;4943.209086546171;4954.752262386866;4964.453910069889;5013.197888337885;5799;5825.388334224887;5844.655729182269;5853.068487399148;5863.736131874076;4210.726302790309;4217.325227963511;4230.471191101113;4244.639205667522;4253.276942919681;5832.358440571534;6063.150319349943;6084.939150608481;6099.57302988791;6140.723667434976;4311.318585751559;4319.740815551077;4321.3301938199;4336.349547567827;4348.956510434855;4345.630621397217;4353.085851971058;4360.236958532244;4380.824767009284;4384.978075109604;4820.638452116105;4953.1332016896895;4962.181240095416;4971.6271279654175;5041.319421878073;5847;5863.442972917651;5886;5889.263842019747;5914.9704251479325;1483.8367779544242;1499.482678475924;1501.2418728542016;1519.8328183899762;1526.7938828258043;966.3863446711389;991.1575161113141;1004.5630150884389;1021.6373187518473;1025.564135242519;5628;5648.293963254593;5654.4062873398525;5677.403872593401;5735.827925162252;5940.851478712981;5966.552508561876;5992.880142397127;6067.787627433018;6091.360407157184;5303.496167864047;5577.581681373832;5579.442055794388;5590.636608620427;5597.384287728347;3143.795653282529;3205.3108581655056;3243.1243564237993;3261.4292498812615;3264.5919260092487;5967.16459695643;6138.570300079041;6140.907886381708;6141;6151.907721384183;6073.7245178513;6088.325710429667;6095.817125486243;6134.15975207436;6163.1679723237685;5939.930812453714;6107.725152368154;6128.724207410677;6170.598911070766;6213.782517611952;5913.911291330547;5991.970040149771;6014.8195554133445;6074.483668888194;6101.139152558512;5924.548485620878;5983.820485385445;6001.639901605918;6004.309504407049;6053.818385448443;5842.269716285465;6082.36135205797;6118;6128.877422451436;6183.721732521957;4200.642945349679;4204.51648060477;4210.59999300066;4224.619784219435;4226.5418430641375;5768.451997060272;5770;5939.613925094855;5956.26012034469;5985;5828.59199856006;5850.94149058504;5899.882002360015;5905.734241959036;5918.704064796829;5614.63504872182;5811.157382179645;5861.912071319019;5899.587028907935;5902.173695682522;5724.341700704473;5758.740856661544;5759.222504961776;5774.162746401832;5806;5883.852903677271;5899.793507227227;5949.137375080502;5960.493358064613;5984.491318237999;5575.275214222125;5801.506871915934;5830.941690583039;5833.416658334133;5907.734151963086 07:39:43 INFO - PROCESS | 3932 | |5;yui.html;646.1664452855813;710.4281053751728;739.4823623463577;829.4401279136581;844.611478719789;14907.32917018734;15681.29434175462;15872.603184920368;15959.361625534964;15970.680586388266;14985.550433487013;15271.6945661087;15293.617659558517;15314.234288285568;15326.08043517387;669.7220653428822;789.3842802613941;795.2326005404783;811.7118422959853;814.242754238558;820.7619790260848;822.5393779483478;824.9793755156109;825.2036784502953;827.4001349021971;870.3081050564784;872.6029656506274;872.6116877989298;872.8254349130168;874.0167311774254;861.7759382560516;862.4609618988133;864.3344624639025;865.3812524045306;869.6347534035721;628.8302158417248;634.6477704873794;635.202820460324;635.2948227467507;635.3106879036205;14709.779353309708;14869.256537173098;14874.479393221185;14927.925360373238;14937.477188298357;13804.585862424143;13954.720905581831;14015.50945716895;14132.434702611883;14216.14703117806;11845;12004.69988250292;12021.51913923442;12060.095492838072;12071.577494787729;3976.5029371328583;3996.9200615987806;4014.959850401488;4032;4148.377743338493;62139;65494;66441.66779166121;72954.63522682406;74364;10744.892551074388;10848.132149428027;10853.891461085446;10936;11043.447827608587;19716.507087322643;19790.505237368892;19814.900925495567;19817.405477835688;20021.799782002287;8433.578321084044;8508.02157751854;8514;8577.228049475452;8753.518556479328;4617.468991066004;4744.857654270378;4888.535589119028;4993;5016.54851063406;3558.217192217708;3702.148505843671;3704.4443333499653;3709.0912726382207;3725.2549490102087;608.6865264388844;620.6245221640843;631.8420394901275;634.7397566997508;654.5156584127807;694.5103701890155;698.6760089630122;731.3564063624083;733.2410954662006;743.5204293230836;9882.407055576545;10023.69928902134;10027.448490332956;10287;10397.688069357931;696.7039008421502;705.1784670858495;708.1572928215408;711.9359257666835;724.6883839948767;4959.553640172402;4963.6277279204205;4974.353334066621;4990.3762029746285;5026.371703537058;116968.41515792366;117475;117805.41097294459;118271.40864295796;120021.39989300173;91218.54390728004;94392;94836;94889;95255;84033.57983210045;87971;88178;88261;89041.55479222692;8809.383343165917;8883.156100170474;8985.820283594423;9034.27725781949;9354.71935841926;48619.75690121527;48741.75629121832;49655.75172124261;50380.49619503905;50760.23859642182;23625;23776.64335034941;32082;67570.66214668895;74612;12923.806142908052;13115.606531804062;13222.735545288848;13439.260840653858;13630.727385452037;14348.995570309979;15429.305681244146;15521.844781552492;16126.67746645084;16428.096454695107;13142.80285795733;13143.474261029452;13558.593242202749;14532.782008269673;15395.3072111753;13913.652158696113;13977.58067257984;14625;14736.189509577076;15147.697046059238;13166.539171128965;13579.185248885098;13635.795463067863;13781.724365512835;14091.577252682437;11136.276142050741;11495.195336326711;11593.188476806543;11685.415729213335;11700.180987330805;11802.291862488279;11817.586384476503;11949.64151075469;12162.878371216175;12176.57381991626 07:39:43 INFO - PROCESS | 3932 | __end_tp_report 07:39:43 INFO - PROCESS | 3932 | __start_cc_report 07:39:43 INFO - PROCESS | 3932 | _x_x_mozilla_cycle_collect,355 07:39:43 INFO - PROCESS | 3932 | __end_cc_report 07:39:43 INFO - PROCESS | 3932 | __startTimestamp1466087983569__endTimestamp 07:39:43 INFO - PROCESS | 3932 | 07:39:43 INFO - PROCESS | 3932 | ------- Summary: start ------- 07:39:43 INFO - PROCESS | 3932 | Number of tests: 6 07:39:43 INFO - PROCESS | 3932 | 07:39:43 INFO - PROCESS | 3932 | [#0] dojo.html Cycles:165 Average:5464.70 Median:5715.17 stddev:737.91 (12.9%) stddev-sans-first:716.89 07:39:43 INFO - PROCESS | 3932 | Values: 3120.5 3141.3 3174.9 3178.0 3184.0 5468.7 5476.8 5564.5 5585.1 5590.0 5365.8 5445.6 5454.2 5454.6 5543.3 4890.2 4912.0 5034.6 5080.1 5117.9 830.5 4943.8 4989.4 5060.2 5099.5 5011.8 5015.6 5018.3 5033.9 5054.7 5061.9 5062.1 5065.8 5078.0 5098.9 4990.3 5023.9 5042.2 5043.8 5087.1 5559.1 5567.5 5577.1 5590.9 5596.4 5780.7 5815.0 5822.9 5876.6 5933.4 6004.2 6004.5 6017.5 6038.7 6115.5 5545.2 5550.8 5558.8 5559.1 5560.4 5911.1 5999.1 6045.0 6058.8 6061.4 5811.5 5814.3 5815.2 5815.6 5855.5 5993.6 5998.4 6000.5 6005.4 6015.1 5679.3 5693.0 5726.8 5735.1 5967.4 5693.6 5698.9 5705.3 5780.2 5789.5 4282.8 4365.1 4372.9 4384.3 4396.0 3928.4 4005.3 4037.6 4057.9 4065.7 5523.5 5647.4 5655.9 5670.9 5678.4 5902.3 5937.0 5958.2 5989.1 5999.0 5639.7 5678.7 5679.9 5680.4 5690.5 4901.5 4931.9 4948.8 4958.9 4984.1 6121.5 6141.9 6155.9 6162.4 6171.6 5825.9 5846.4 5957.9 5963.8 5970.6 6024.2 6063.0 6098.3 6118.3 6166.2 5832.1 5841.3 5866.7 5872.9 5912.5 5852.7 5977.1 5981.5 6000.5 6000.9 5737.9 5788.7 5796.1 5850.1 5850.4 5715.2 5718.1 5746.0 5755.7 5783.1 5592.8 5687.2 5702.7 5716.9 5729.1 5826.1 5900.5 5913.5 5925.3 5945.2 5778.0 5781.2 5802.2 5802.7 5815.2 07:39:43 INFO - PROCESS | 3932 | 07:39:43 INFO - PROCESS | 3932 | [#1] ext.html Cycles:180 Average:60828.72 Median:40633.69 stddev:126510.43 (311.3%) stddev-sans-first:126784.37 07:39:43 INFO - PROCESS | 3932 | Values: 551.2 598.3 614.6 618.2 630.8 40092.6 41661.4 41990.4 42006.0 43643.8 42591.6 42945.1 43057.6 43134.4 43207.6 8968.4 8999.2 9028.0 9041.1 9118.7 8856.1 8990.7 9006.6 9011.9 9038.4 9004.7 9015.2 9053.6 9060.2 9068.0 8864.5 8869.5 8924.9 9035.9 9036.6 8876.4 8903.0 8923.1 8962.3 8987.9 40118.8 40534.4 40557.1 40665.2 40699.6 3570.8 3695.4 3773.9 4152.8 4344.3 31506.2 32013.5 32177.2 32301.7 33385.0 4008.0 4171.3 4345.9 4383.2 4403.1 332250.0 332668.0 333599.0 334303.0 334475.0 32939.0 59369.4 59571.4 59924.0 60197.0 33658.8 35347.5 35468.8 35503.6 35546.5 15035.5 15143.8 15151.1 15238.8 15246.9 12485.3 12582.7 12588.9 12613.1 12677.0 8141.2 8195.7 8246.7 8254.9 8323.8 3239.3 3249.4 3295.0 3338.6 3362.5 989.0 1088.8 1120.9 1125.6 1135.3 30866.7 31446.4 31520.8 32057.2 32151.8 1076.4 1097.1 1117.9 1131.2 1140.8 16663.4 16970.9 17355.6 17385.8 18049.2 567399.0 576520.0 577916.0 578283.0 579313.0 57592.7 58405.7 58749.7 58777.7 58899.7 1272.0 1342.3 1343.5 1357.5 1377.9 31176.2 32191.5 32478.8 32582.0 32723.6 49169.3 49984.5 50137.0 50427.5 50475.5 480799.0 482876.0 482929.0 482967.0 485344.0 27705.3 27751.6 28224.0 28239.3 28358.9 46731.0 47404.3 47500.5 47649.5 48079.0 40373.0 40681.8 41161.2 41163.8 41511.8 39571.4 40104.9 40387.0 40405.6 40553.4 40086.2 40602.2 41231.2 41379.8 44667.8 34755.7 37744.0 37779.8 38087.8 38605.4 28071.6 28207.0 28341.9 28800.1 28923.9 07:39:43 INFO - PROCESS | 3932 | 07:39:43 INFO - PROCESS | 3932 | [#2] jquery.html Cycles:180 Average:26836.15 Median:2366.50 stddev:73543.38 (3107.7%) stddev-sans-first:73722.87 07:39:43 INFO - PROCESS | 3932 | Values: 383.2 384.8 389.8 393.6 410.6 13599.9 17903.9 18602.8 19242.1 19278.8 15026.2 15704.5 16891.9 17675.2 17815.7 4903.0 5232.8 5239.0 5239.8 5244.0 5035.4 5133.3 5166.8 5177.2 5180.8 5188.1 5207.9 5217.6 5315.3 5315.4 5275.2 5836.4 5844.6 5860.2 5860.8 5056.5 5186.1 5188.9 5191.3 5198.8 13888.5 14741.2 22248.7 22808.0 22864.2 2125.5 2278.7 2279.1 2327.6 2405.4 10016.9 10074.3 10362.1 10542.5 14989.7 1700.5 1756.0 1883.3 1946.3 1986.2 75287.0 77765.6 78020.0 78149.6 78423.0 10906.6 11084.3 11189.3 11241.9 11273.2 15245.9 15255.8 15315.2 15368.3 15415.1 7231.9 7502.2 7696.0 7864.8 7973.5 7308.8 7434.0 7459.8 7461.6 7569.8 4773.7 4787.1 4798.2 4799.2 4842.7 1808.0 1893.2 1898.5 1965.5 1978.7 983.1 986.1 1042.0 1049.9 1064.1 19130.7 19256.2 19549.1 19737.4 19997.8 961.4 1008.3 1023.7 1048.1 1054.5 9693.2 10962.8 11020.7 11065.5 11117.2 439156.0 441219.0 443545.0 453816.0 456174.0 54176.0 58675.4 84910.0 85596.0 88949.6 964.3 968.4 997.6 1001.3 1001.3 16726.6 16989.5 16995.0 17138.3 17527.9 38577.4 38908.0 39140.8 40312.2 40916.6 54496.2 55365.7 55978.4 56117.0 56724.4 7618.6 7979.4 8649.9 8753.6 8873.6 13301.3 13880.4 13941.2 13961.7 14116.0 11743.8 11815.6 12198.0 12252.1 12435.3 11559.8 12119.8 12231.9 12289.3 12493.2 11635.9 11694.9 11827.2 11837.4 12085.9 7876.9 8049.4 8122.5 8206.4 8239.3 8855.3 11265.9 11699.2 11905.6 11964.8 07:39:43 INFO - PROCESS | 3932 | 07:39:43 INFO - PROCESS | 3932 | [#3] mootools.html Cycles:180 Average:5470.72 Median:4982.72 stddev:3053.51 (61.3%) stddev-sans-first:3047.07 07:39:43 INFO - PROCESS | 3932 | Values: 1442.4 1467.9 1551.3 1666.3 1684.2 7361.2 7747.6 7973.2 8281.0 8323.0 8035.3 8052.2 8080.5 8092.8 8167.4 2249.0 2280.7 2288.9 2293.9 2295.1 2242.2 2253.3 2317.4 2325.6 2325.7 2286.0 2301.6 2305.1 2317.9 2321.9 2167.6 2169.8 2204.1 2211.2 2212.4 2217.5 2221.3 2226.2 2227.8 2229.4 8392.4 8405.2 8409.2 8426.8 8454.2 4930.5 4936.4 4966.5 4974.1 5087.8 3143.8 3241.0 3400.8 3466.4 3479.6 1072.7 1091.7 1096.1 1108.8 1109.0 11474.5 11534.3 11573.4 11581.4 11611.7 4321.2 4371.0 4377.5 4455.1 4472.8 9627.7 9640.3 9651.3 9668.8 9676.0 4965.3 4978.4 4987.1 5006.9 5036.3 4120.9 4505.7 4642.9 4661.3 4679.5 3765.6 3778.5 3854.4 3870.5 3884.0 1164.2 1201.3 1214.2 1220.4 1228.4 845.9 863.7 882.0 914.6 930.0 5677.9 5702.3 5725.3 5849.1 5856.2 924.8 949.9 951.6 962.5 999.8 3894.7 3908.4 3940.5 3961.9 3989.5 10018.6 10417.5 10434.2 10444.3 10446.6 10043.9 10206.1 10282.3 10309.7 10386.3 7661.7 7728.8 7780.2 7784.6 7794.3 5262.2 5349.3 5458.9 5489.1 5497.7 9152.8 9335.7 9511.9 9592.9 9605.2 9495.1 9500.0 9588.4 9603.0 9639.0 6371.1 6885.0 7069.5 7418.3 7786.1 7782.6 7892.1 7919.2 7962.4 7969.0 6798.0 6971.7 6989.7 7034.4 7254.7 6897.7 6917.3 6976.9 7035.5 7115.3 6596.2 6647.6 6670.7 6674.6 6696.1 4924.9 4967.2 4967.7 4976.1 5043.8 4892.3 5106.4 5150.6 5169.3 5234.5 07:39:43 INFO - PROCESS | 3932 | 07:39:43 INFO - PROCESS | 3932 | [#4] prototype.html Cycles:180 Average:4924.05 Median:5621.32 stddev:1447.67 (25.8%) stddev-sans-first:1410.11 07:39:43 INFO - PROCESS | 3932 | Values: 332.1 333.1 340.0 340.9 342.1 5606.3 5669.3 5707.2 5717.7 5718.4 5549.4 5559.6 5579.2 5587.8 5604.7 4153.6 4199.8 4292.0 4338.5 4342.9 4294.6 4303.0 4327.7 4329.5 4329.6 4291.1 4332.7 4364.0 4374.0 4380.1 4174.4 4280.9 4281.7 4303.5 4322.2 3771.8 3772.3 3779.2 3783.1 3787.1 5418.0 5431.5 5455.1 5475.9 5490.4 4895.5 4943.2 4954.8 4964.5 5013.2 5799.0 5825.4 5844.7 5853.1 5863.7 4210.7 4217.3 4230.5 4244.6 4253.3 5832.4 6063.2 6084.9 6099.6 6140.7 4311.3 4319.7 4321.3 4336.3 4349.0 4345.6 4353.1 4360.2 4380.8 4385.0 4820.6 4953.1 4962.2 4971.6 5041.3 5847.0 5863.4 5886.0 5889.3 5915.0 1483.8 1499.5 1501.2 1519.8 1526.8 966.4 991.2 1004.6 1021.6 1025.6 5628.0 5648.3 5654.4 5677.4 5735.8 5940.9 5966.6 5992.9 6067.8 6091.4 5303.5 5577.6 5579.4 5590.6 5597.4 3143.8 3205.3 3243.1 3261.4 3264.6 5967.2 6138.6 6140.9 6141.0 6151.9 6073.7 6088.3 6095.8 6134.2 6163.2 5939.9 6107.7 6128.7 6170.6 6213.8 5913.9 5992.0 6014.8 6074.5 6101.1 5924.5 5983.8 6001.6 6004.3 6053.8 5842.3 6082.4 6118.0 6128.9 6183.7 4200.6 4204.5 4210.6 4224.6 4226.5 5768.5 5770.0 5939.6 5956.3 5985.0 5828.6 5850.9 5899.9 5905.7 5918.7 5614.6 5811.2 5861.9 5899.6 5902.2 5724.3 5758.7 5759.2 5774.2 5806.0 5883.9 5899.8 5949.1 5960.5 5984.5 5575.3 5801.5 5830.9 5833.4 5907.7 07:39:43 INFO - PROCESS | 3932 | 07:39:43 INFO - PROCESS | 3932 | [#5] yui.html Cycles:180 Average:19748.47 Median:4090.19 stddev:28566.24 (698.4%) stddev-sans-first:28610.37 07:39:43 INFO - PROCESS | 3932 | Values: 646.2 710.4 739.5 829.4 844.6 14907.3 15681.3 15872.6 15959.4 15970.7 14985.6 15271.7 15293.6 15314.2 15326.1 669.7 789.4 795.2 811.7 814.2 820.8 822.5 825.0 825.2 827.4 870.3 872.6 872.6 872.8 874.0 861.8 862.5 864.3 865.4 869.6 628.8 634.6 635.2 635.3 635.3 14709.8 14869.3 14874.5 14927.9 14937.5 13804.6 13954.7 14015.5 14132.4 14216.1 11845.0 12004.7 12021.5 12060.1 12071.6 3976.5 3996.9 4015.0 4032.0 4148.4 62139.0 65494.0 66441.7 72954.6 74364.0 10744.9 10848.1 10853.9 10936.0 11043.4 19716.5 19790.5 19814.9 19817.4 20021.8 8433.6 8508.0 8514.0 8577.2 8753.5 4617.5 4744.9 4888.5 4993.0 5016.5 3558.2 3702.1 3704.4 3709.1 3725.3 608.7 620.6 631.8 634.7 654.5 694.5 698.7 731.4 733.2 743.5 9882.4 10023.7 10027.4 10287.0 10397.7 696.7 705.2 708.2 711.9 724.7 4959.6 4963.6 4974.4 4990.4 5026.4 116968.4 117475.0 117805.4 118271.4 120021.4 91218.5 94392.0 94836.0 94889.0 95255.0 84033.6 87971.0 88178.0 88261.0 89041.6 8809.4 8883.2 8985.8 9034.3 9354.7 48619.8 48741.8 49655.8 50380.5 50760.2 23625.0 23776.6 32082.0 67570.7 74612.0 12923.8 13115.6 13222.7 13439.3 13630.7 14349.0 15429.3 15521.8 16126.7 16428.1 13142.8 13143.5 13558.6 14532.8 15395.3 13913.7 13977.6 14625.0 14736.2 15147.7 13166.5 13579.2 13635.8 13781.7 14091.6 11136.3 11495.2 11593.2 11685.4 11700.2 11802.3 11817.6 11949.6 12162.9 12176.6 07:39:43 INFO - PROCESS | 3932 | -------- Summary: end -------- 07:39:43 INFO - PROCESS | 3932 | 07:39:44 INFO - TEST-INFO | 3932: exit 0 07:39:44 INFO - TEST-OK | dromaeo_css | took 1112092ms 07:39:44 INFO - TEST-START | kraken 07:39:44 INFO - operating with platform_type : linux_ 07:39:44 INFO - Initialising browser for kraken test... 07:39:44 INFO - TEST-INFO | started process 4208 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWYf5xW/profile http://localhost:56579/getInfo.html) 07:39:49 INFO - PROCESS | 4208 | __metrics Screen width/height:1600/1200 07:39:49 INFO - PROCESS | 4208 | colorDepth:24 07:39:49 INFO - PROCESS | 4208 | Browser inner width/height: 1024/697 07:39:49 INFO - PROCESS | 4208 | __metrics 07:39:49 ERROR - PROCESS | 4208 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2947: TypeError: this.tabs is undefined 07:39:50 INFO - TEST-INFO | 4208: exit 0 07:39:50 INFO - Browser initialized. 07:39:50 INFO - Running cycle 1/1 for kraken test... 07:39:50 INFO - TEST-INFO | started process 4331 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWYf5xW/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:40:02 INFO - PROCESS | 4331 | RSS: Main: 185434112 07:40:02 INFO - PROCESS | 4331 | 07:40:04 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:56579/tests/kraken/driver.html?testName=audio-beat-detection) 07:40:05 INFO - PROCESS | 4331 | RSS: Main: 190799872 07:40:05 INFO - PROCESS | 4331 | 07:40:08 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:56579/tests/kraken/driver.html?testName=audio-dft) 07:40:09 INFO - PROCESS | 4331 | RSS: Main: 190181376 07:40:09 INFO - PROCESS | 4331 | 07:40:12 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:56579/tests/kraken/driver.html?testName=audio-fft) 07:40:12 INFO - PROCESS | 4331 | RSS: Main: 184954880 07:40:12 INFO - PROCESS | 4331 | 07:40:14 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:56579/tests/kraken/driver.html?testName=audio-oscillator) 07:40:15 INFO - PROCESS | 4331 | RSS: Main: 186155008 07:40:15 INFO - PROCESS | 4331 | 07:40:17 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:56579/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:40:18 INFO - PROCESS | 4331 | RSS: Main: 186363904 07:40:18 INFO - PROCESS | 4331 | 07:40:21 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:56579/tests/kraken/driver.html?testName=imaging-darkroom) 07:40:21 INFO - PROCESS | 4331 | RSS: Main: 186384384 07:40:21 INFO - PROCESS | 4331 | 07:40:25 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:56579/tests/kraken/driver.html?testName=imaging-desaturate) 07:40:26 INFO - PROCESS | 4331 | RSS: Main: 183435264 07:40:26 INFO - PROCESS | 4331 | 07:40:29 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:56579/tests/kraken/driver.html?testName=json-parse-financial) 07:40:29 INFO - PROCESS | 4331 | RSS: Main: 184512512 07:40:29 INFO - PROCESS | 4331 | 07:40:31 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:56579/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:40:31 INFO - PROCESS | 4331 | RSS: Main: 185180160 07:40:31 INFO - PROCESS | 4331 | 07:40:33 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:56579/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:40:34 INFO - PROCESS | 4331 | RSS: Main: 185618432 07:40:34 INFO - PROCESS | 4331 | 07:40:36 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:56579/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:40:37 INFO - PROCESS | 4331 | RSS: Main: 186654720 07:40:37 INFO - PROCESS | 4331 | 07:40:39 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:56579/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:40:40 INFO - PROCESS | 4331 | RSS: Main: 186433536 07:40:40 INFO - PROCESS | 4331 | 07:40:43 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:56579/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:40:43 INFO - PROCESS | 4331 | RSS: Main: 186224640 07:40:43 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | Cycle 1(1): loaded http://localhost:56579/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:56579/tests/kraken/driver.html?testName=ai-astar) 07:40:45 INFO - PROCESS | 4331 | RSS: Main: 187187200 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | __start_tp_report 07:40:45 INFO - PROCESS | 4331 | _x_x_mozilla_page_load 07:40:45 INFO - PROCESS | 4331 | _x_x_mozilla_page_load_details 07:40:45 INFO - PROCESS | 4331 | |i|pagename|runs| 07:40:45 INFO - PROCESS | 4331 | |0;ai-astar;112;107;112;112;112;113;111;115;114;111 07:40:45 INFO - PROCESS | 4331 | |1;audio-beat-detection;158;129;156;181;128;162;151;127;181;135 07:40:45 INFO - PROCESS | 4331 | |2;audio-dft;162;164;167;164;167;173;166;162;163;163 07:40:45 INFO - PROCESS | 4331 | |3;audio-fft;75;75;75;169;76;75;75;75;178;75 07:40:45 INFO - PROCESS | 4331 | |4;audio-oscillator;87;85;147;86;84;86;138;85;94;147 07:40:45 INFO - PROCESS | 4331 | |5;imaging-gaussian-blur;118;117;117;120;118;117;117;118;118;118 07:40:45 INFO - PROCESS | 4331 | |6;imaging-darkroom;149;146;146;149;147;147;147;151;150;150 07:40:45 INFO - PROCESS | 4331 | |7;imaging-desaturate;96;95;95;95;96;96;95;97;96;97 07:40:45 INFO - PROCESS | 4331 | |8;json-parse-financial;54;54;55;53;60;56;54;55;55;54 07:40:45 INFO - PROCESS | 4331 | |9;json-stringify-tinderbox;61;61;61;61;63;62;62;63;61;62 07:40:45 INFO - PROCESS | 4331 | |10;stanford-crypto-aes;82;80;79;87;81;83;90;82;111;82 07:40:45 INFO - PROCESS | 4331 | |11;stanford-crypto-ccm;131;124;124;122;135;131;139;131;126;133 07:40:45 INFO - PROCESS | 4331 | |12;stanford-crypto-pbkdf2;168;165;162;161;164;162;164;165;158;161 07:40:45 INFO - PROCESS | 4331 | |13;stanford-crypto-sha256-iterative;63;63;64;64;71;64;63;62;69;62 07:40:45 INFO - PROCESS | 4331 | __end_tp_report 07:40:45 INFO - PROCESS | 4331 | __start_cc_report 07:40:45 INFO - PROCESS | 4331 | _x_x_mozilla_cycle_collect,893 07:40:45 INFO - PROCESS | 4331 | __end_cc_report 07:40:45 INFO - PROCESS | 4331 | __startTimestamp1466088045579__endTimestamp 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | ------- Summary: start ------- 07:40:45 INFO - PROCESS | 4331 | Number of tests: 14 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#0] ai-astar Cycles:10 Average:111.90 Median:112.00 stddev:2.13 (1.9%) stddev-sans-first:2.26 07:40:45 INFO - PROCESS | 4331 | Values: 112.0 107.0 112.0 112.0 112.0 113.0 111.0 115.0 114.0 111.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#1] audio-beat-detection Cycles:10 Average:150.80 Median:157.00 stddev:20.65 (13.2%) stddev-sans-first:21.74 07:40:45 INFO - PROCESS | 4331 | Values: 158.0 129.0 156.0 181.0 128.0 162.0 151.0 127.0 181.0 135.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#2] audio-dft Cycles:10 Average:165.10 Median:165.00 stddev:3.35 (2.0%) stddev-sans-first:3.36 07:40:45 INFO - PROCESS | 4331 | Values: 162.0 164.0 167.0 164.0 167.0 173.0 166.0 162.0 163.0 163.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#3] audio-fft Cycles:10 Average:94.80 Median:75.00 stddev:41.53 (55.4%) stddev-sans-first:43.43 07:40:45 INFO - PROCESS | 4331 | Values: 75.0 75.0 75.0 169.0 76.0 75.0 75.0 75.0 178.0 75.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#4] audio-oscillator Cycles:10 Average:103.90 Median:85.50 stddev:27.91 (32.6%) stddev-sans-first:28.93 07:40:45 INFO - PROCESS | 4331 | Values: 87.0 85.0 147.0 86.0 84.0 86.0 138.0 85.0 94.0 147.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#5] imaging-gaussian-blur Cycles:10 Average:117.80 Median:118.00 stddev:0.92 (0.8%) stddev-sans-first:0.97 07:40:45 INFO - PROCESS | 4331 | Values: 118.0 117.0 117.0 120.0 118.0 117.0 117.0 118.0 118.0 118.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#6] imaging-darkroom Cycles:10 Average:148.20 Median:149.00 stddev:1.81 (1.2%) stddev-sans-first:1.90 07:40:45 INFO - PROCESS | 4331 | Values: 149.0 146.0 146.0 149.0 147.0 147.0 147.0 151.0 150.0 150.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:96.00 stddev:0.79 (0.8%) stddev-sans-first:0.83 07:40:45 INFO - PROCESS | 4331 | Values: 96.0 95.0 95.0 95.0 96.0 96.0 95.0 97.0 96.0 97.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#8] json-parse-financial Cycles:10 Average:55.00 Median:55.00 stddev:1.94 (3.5%) stddev-sans-first:2.03 07:40:45 INFO - PROCESS | 4331 | Values: 54.0 54.0 55.0 53.0 60.0 56.0 54.0 55.0 55.0 54.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#9] json-stringify-tinderbox Cycles:10 Average:61.70 Median:62.00 stddev:0.82 (1.3%) stddev-sans-first:0.83 07:40:45 INFO - PROCESS | 4331 | Values: 61.0 61.0 61.0 61.0 63.0 62.0 62.0 63.0 61.0 62.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#10] stanford-crypto-aes Cycles:10 Average:85.70 Median:82.00 stddev:9.48 (11.6%) stddev-sans-first:9.96 07:40:45 INFO - PROCESS | 4331 | Values: 82.0 80.0 79.0 87.0 81.0 83.0 90.0 82.0 111.0 82.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#11] stanford-crypto-ccm Cycles:10 Average:129.60 Median:131.00 stddev:5.46 (4.2%) stddev-sans-first:5.77 07:40:45 INFO - PROCESS | 4331 | Values: 131.0 124.0 124.0 122.0 135.0 131.0 139.0 131.0 126.0 133.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.00 Median:164.00 stddev:2.79 (1.7%) stddev-sans-first:2.30 07:40:45 INFO - PROCESS | 4331 | Values: 168.0 165.0 162.0 161.0 164.0 162.0 164.0 165.0 158.0 161.0 07:40:45 INFO - PROCESS | 4331 | 07:40:45 INFO - PROCESS | 4331 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.50 Median:64.00 stddev:3.03 (4.7%) stddev-sans-first:3.16 07:40:45 INFO - PROCESS | 4331 | Values: 63.0 63.0 64.0 64.0 71.0 64.0 63.0 62.0 69.0 62.0 07:40:45 INFO - PROCESS | 4331 | -------- Summary: end -------- 07:40:45 INFO - PROCESS | 4331 | 07:40:46 INFO - TEST-INFO | 4331: exit 0 07:40:46 INFO - TEST-OK | kraken | took 62239ms 07:40:46 INFO - SUITE-END | took 1174s 07:40:46 INFO - Completed test suite (00:19:34) 07:40:46 INFO - javascript benchmark 07:40:46 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7162.677422054972, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3120.469520181569, 3141.3089120393506, 3174.9365012699745, 3178.046586024192, 3183.9681603183976, 5468.699221542814, 5476.808311709091, 5564.527015203707, 5585.078462053766, 5590.049691552435, 5365.839024829262, 5445.591580631449, 5454.181872719094, 5454.563634909207, 5543.279373681416, 4890.21756518957, 4911.950880491185, 5034.622403319766, 5080.110980578384, 5117.948820511803, 830.5477645009674, 4943.752812359386, 4989.426215985171, 5060.215666571669, 5099.464556221599, 5011.799528018893, 5015.5736762375245, 5018.2974383586325, 5033.949660503421, 5054.7472626368535, 5061.873453163664, 5062.1141300272675, 5065.848024559269, 5078.035173317058, 5098.923516147261, 4990.326305948687, 5023.874403139951, 5042.193249080129, 5043.823466178703, 5087.109755792721, 5559.054960656698, 5567.526760225385, 5577.135543990647, 5590.91613625796, 5596.356419011825, 5780.682062486561, 5814.97092514539, 5822.883542329129, 5876.559258055663, 5933.406659334075, 6004.159417681528, 6004.459598636144, 6017.548683848685, 6038.698065096728, 6115.48018418435, 5545.223668686387, 5550.833474995757, 5558.805441809558, 5559.054960656698, 5560.360558535739, 5911.142884281755, 5999.100134979701, 6045.0327947528185, 6058.848528786727, 6061.363556826558, 5811.535077193815, 5814.3313518945015, 5815.156802263648, 5815.563832712563, 5855.531557475391, 5993.580449368503, 5998.400159983967, 6000.489958353502, 6005.369436209223, 6015.127806468037, 5679.261695979579, 5693.032184528557, 5726.828195154152, 5735.082386818089, 5967.433093856077, 5693.572982026365, 5698.857528561819, 5705.343885453226, 5780.1907732917425, 5789.507891829157, 4282.76444795533, 4365.126974605028, 4372.912541749147, 4384.342348647729, 4396.010897548026, 3928.3910993796007, 4005.2590270799997, 4037.555868854424, 4057.89855253621, 4065.6747460203114, 5523.502884740393, 5647.435256474402, 5655.915161272585, 5670.943290567124, 5678.4037676044245, 5902.321233058254, 5937.0, 5958.165856780054, 5989.101634754822, 5998.970005149947, 5639.746211420496, 5678.716064196774, 5679.914801277984, 5680.375158732536, 5690.5447564194765, 4901.460839307673, 4931.87670308238, 4948.826791062295, 4958.933829226734, 4984.077945580079, 6121.510279177655, 6141.877162456815, 6155.938440615626, 6162.352952939967, 6171.6297022178815, 5825.912611310919, 5846.386129456346, 5957.880842383128, 5963.821085367446, 5970.5522085844605, 6024.186734790923, 6063.0, 6098.311206366174, 6118.326984031664, 6166.167567378347, 5832.096025116114, 5841.269841269841, 5866.67733274674, 5872.882542349043, 5912.526997840077, 5852.736626851887, 5977.073553599199, 5981.461668449861, 6000.549958753024, 6000.87998240024, 5737.942620573741, 5788.7395067222915, 5796.072628379439, 5850.063989761617, 5850.444207800252, 5715.171300161536, 5718.056520674042, 5746.0, 5755.71221438918, 5783.103618939072, 5592.804251851166, 5687.232223649754, 5702.657840529581, 5716.9428305718075, 5729.054705973635, 5826.126081087871, 5900.527957763283, 5913.526917846648, 5925.288965324189, 5945.227120474311, 5777.971110144423, 5781.161731548986, 5802.216700745515, 5802.6808525531505, 5815.2149459822385], "value": 5414.999257954783, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [551.2007588995955, 598.2999890128549, 614.6342925959054, 618.1593033474477, 630.8139098965802, 40092.59907400925, 41661.375079373836, 41990.37014444786, 42006.0, 43643.78178109113, 42591.57408425915, 42945.141097178035, 43057.569424305824, 43134.352984705256, 43207.56792432075, 8968.372213945026, 8999.235065019448, 9028.0, 9041.14109159632, 9118.680846170386, 8856.070112638177, 8990.730278091634, 9006.59470323837, 9011.909880901172, 9038.412503187305, 9004.729858104234, 9015.188633023026, 9053.637854485845, 9060.229880460169, 9067.95466022669, 8864.512451815148, 8869.467831930073, 8924.910750892506, 9035.909640903637, 9036.593353299051, 8876.378653494257, 8902.955485222597, 8923.063078376741, 8962.283017358595, 8987.910120898772, 40118.799406003076, 40534.39198412026, 40557.14707102821, 40665.18669626591, 40699.59300407017, 3570.7500474966764, 3695.4456831475227, 3773.8867833965023, 4152.771597562133, 4344.348347747863, 31506.212344691336, 32013.519797203062, 32177.1955701107, 32301.676983230103, 33385.0, 4008.0, 4171.270027745132, 4345.9130817383475, 4383.211022016036, 4403.097365040159, 332250.0, 332668.0, 333599.0, 334303.0, 334475.0, 32939.01182964467, 59369.40630593639, 59571.404285957455, 59924.0, 60197.0, 33658.8317058418, 35347.4697879532, 35468.82265588656, 35503.64496355003, 35546.46680299797, 15035.54893353201, 15143.772843407358, 15151.090934543963, 15238.847611523743, 15246.923765381323, 12485.313307767978, 12582.685432864251, 12588.874111258954, 12613.054020948466, 12677.0, 8141.22658347456, 8195.67217311301, 8246.711365102192, 8254.876176857351, 8323.791905202419, 3239.271163988084, 3249.447593909041, 3295.0, 3338.6160591532284, 3362.529245905575, 988.9505524723735, 1088.7604726960055, 1120.9271397359146, 1125.6229163230246, 1135.335828540313, 30866.69133308683, 31446.37107257842, 31520.842395787873, 32057.17812419115, 32151.839240803645, 1076.424113099488, 1097.1497089755503, 1117.871444783844, 1131.185546406586, 1140.8402823604702, 16663.416780412626, 16970.915145424442, 17355.56611084733, 17385.82614173842, 18049.187786549635, 567399.0, 576520.0, 577916.0, 578283.0, 579313.0, 57592.71203643955, 58405.70797145987, 58749.706251468466, 58777.70611147003, 58899.70550147222, 1272.0, 1342.335543905773, 1343.4559003603556, 1357.5384369314284, 1377.8622137786342, 31176.220594484414, 32191.51712724358, 32478.83760581182, 32582.0, 32723.55098025592, 49169.26246106383, 49984.500154997986, 50137.0, 50427.49572504228, 50475.49524504708, 480799.0, 482876.0, 482929.0, 482967.0, 485344.0, 27705.307367315978, 27751.583726244527, 28224.0, 28239.29401764972, 28358.85820570884, 46731.0, 47404.288935666686, 47500.52499474961, 47649.52350476451, 48079.0, 40372.98311818184, 40681.79659101686, 41161.176776464905, 41163.794181028905, 41511.7924410376, 39571.406428903014, 40104.946030605424, 40387.0, 40405.595944040186, 40553.391699123946, 40086.1982760349, 40602.1879562413, 41231.1753764929, 41379.7931010343, 44667.776661116484, 34755.65244347524, 37744.0, 37779.81110094432, 38087.80956095202, 38605.4209186868, 28071.57892631653, 28207.0, 28341.858290708413, 28800.135995920155, 28923.855380722962], "value": 18977.556579504362, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [383.2105861924436, 384.8383678854879, 389.76419266343856, 393.5684195953562, 410.63248392688547, 13599.864001359983, 17903.910480447597, 18602.813971860276, 19242.13410396532, 19278.807211927877, 15026.17356045417, 15704.450344237954, 16891.91554042228, 17675.20461579229, 17815.73276400855, 4903.0, 5232.843014709546, 5238.973805130969, 5239.764210610512, 5243.973780131113, 5035.370578677665, 5133.255677926699, 5166.767495462713, 5177.197534382177, 5180.818671346504, 5188.118019936601, 5207.895842083156, 5217.608679349045, 5315.309009828717, 5315.388730296007, 5275.182346736243, 5836.416358364151, 5844.620099693507, 5860.150278209636, 5860.765569377241, 5056.544910957995, 5186.1442861927735, 5188.870278243074, 5191.32512773337, 5198.766055527511, 13888.513902013381, 14741.189234592093, 22248.666270005964, 22808.0, 22864.199753008565, 2125.5005073807642, 2278.7002895394457, 2279.11114665279, 2327.569399661051, 2405.434722840131, 10016.899831001743, 10074.345167564084, 10362.067413932782, 10542.47287635615, 14989.700205995929, 1700.5408539694338, 1755.95610109747, 1883.2937648381858, 1946.347973428903, 1986.195590785734, 75287.0, 77765.61117194434, 78020.0, 78149.60925195452, 78423.0, 10906.563737450413, 11084.279521831217, 11189.272697274651, 11241.943790280997, 11273.21087523882, 15245.923770381078, 15255.847441525442, 15315.15766632846, 15368.308426120851, 15415.075095494081, 7231.927680723231, 7502.2122677119205, 7695.961520192363, 7864.803379915548, 7973.521588704696, 7308.817279567947, 7434.0, 7459.776206713807, 7461.626918654046, 7569.750991086409, 4773.71357718538, 4787.114383839001, 4798.2322828348, 4799.160146974265, 4842.709437433765, 1807.9638407231782, 1893.195391958412, 1898.4684288399271, 1965.508622844289, 1978.6735188693704, 983.090641156927, 986.146982859821, 1041.95832166714, 1049.8661445638693, 1064.1380481809604, 19130.71303930442, 19256.22975080981, 19549.120289587, 19737.40787776369, 19997.800021999883, 961.4087336288133, 1008.2740426892772, 1023.744063984004, 1048.130052056791, 1054.4569546683465, 9693.158299922992, 10962.835557466644, 11020.669379918454, 11065.50205240766, 11117.22179447431, 439156.0, 441219.0, 443545.0, 453815.9638027161, 456174.0, 54176.0, 58675.41324586785, 84910.0, 85596.0, 88949.55525222461, 964.286428043243, 968.41894863083, 997.6109317366233, 1001.2540657210279, 1001.3090967232732, 16726.58183545421, 16989.49031529056, 16995.0, 17138.31446742116, 17527.912360438117, 38577.421338680506, 38908.0, 39140.804295978334, 40312.2189706313, 40916.590834092465, 54496.18255726088, 55365.723171383885, 55978.44021559732, 56117.0, 56724.432755673566, 7618.6190690466365, 7979.361651068017, 8649.91350086491, 8753.562321884008, 8873.600687969187, 13301.334933253105, 13880.375383107583, 13941.163530188222, 13961.720765584429, 14116.01187916836, 11743.765124697287, 11815.645530634094, 12198.0, 12252.142350035769, 12435.316057616918, 11559.768804623693, 12119.75760484803, 12231.877681223074, 12289.324087175291, 12493.187942784054, 11635.941820290844, 11694.941525292319, 11827.231229970024, 11837.408129593314, 12085.939570302093, 7876.8818467721885, 8049.39629527776, 8122.5126492410645, 8206.425550211428, 8239.258466738022, 8855.291576673722, 11265.943670281596, 11699.23954942926, 11905.642830715093, 11964.820527692265], "value": 8898.432808314596, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1442.3581506229725, 1467.9486217982371, 1551.2709026757427, 1666.3251383189813, 1684.1663376628571, 7361.227071157518, 7747.61261936903, 7973.242541958519, 8281.047679516858, 8323.042850072243, 8035.276825085741, 8052.235037671427, 8080.515169089844, 8092.797680057986, 8167.428280020401, 2248.999999999996, 2280.749117597063, 2288.942776430586, 2293.8738369389675, 2295.1278514164596, 2242.248846636379, 2253.301476542269, 2317.3974766560646, 2325.5581439526522, 2325.6976593042964, 2285.988570057147, 2301.5742087713825, 2305.13557415969, 2317.9420514487188, 2321.9419514512188, 2167.6098302305577, 2169.7504786949467, 2204.1293688992837, 2211.1708109458955, 2212.413710366754, 2217.523232505019, 2221.31139346803, 2226.2096955580696, 2227.8440509164366, 2229.4092065602626, 8392.370572207048, 8405.243528082441, 8409.159084091603, 8426.78933026673, 8454.154584541497, 4930.506949305077, 4936.358273424467, 4966.528179822911, 4974.054929563371, 5087.771050302708, 3143.779935404523, 3240.983795081033, 3400.7619466637343, 3466.376052310583, 3479.6346383629607, 1072.7210925159436, 1091.7052395853075, 1096.0957210301533, 1108.83921831334, 1108.9944550277196, 11474.541018359256, 11534.307941523452, 11573.42132893352, 11581.36302503362, 11611.709707257387, 4321.200577893037, 4370.956290437119, 4377.518472967971, 4455.086707225011, 4472.843450479283, 9627.663031793854, 9640.325177237526, 9651.324407291562, 9668.806623867484, 9676.0, 4965.32968049316, 4978.377702787152, 4987.0524600325825, 5006.899862002812, 5036.345275114211, 4120.876373708794, 4505.6846020778885, 4642.907141857211, 4661.324108004321, 4679.4618618858585, 3765.6234376562124, 3778.508793856836, 3854.4411060396087, 3870.4968354113785, 3883.96116038836, 1164.2432418927765, 1201.3332600406684, 1214.174361434233, 1220.3837062283667, 1228.3858070964518, 845.9069502354736, 863.7149740585592, 881.9779505512414, 914.5518695838991, 930.0, 5677.9211949729415, 5702.258706368229, 5725.341585717696, 5849.1226316052935, 5856.1508581255475, 924.7595625137378, 949.8765160529088, 951.6478902806006, 962.5427921737258, 999.8200323941614, 3894.746841455353, 3908.4332771748504, 3940.5074365704286, 3961.8613348532663, 3989.4813674222164, 10018.599256029824, 10417.531211095518, 10434.16526677864, 10444.321119127233, 10446.582136714598, 10043.949780251052, 10206.081452669147, 10282.331648442827, 10309.690709278733, 10386.32488888235, 7661.693532258647, 7728.845423091507, 7780.18308077655, 7784.610769461391, 7794.337481314038, 5262.184361423985, 5349.331333583302, 5458.91811622818, 5489.1217405214975, 5497.670139791625, 9152.816943660957, 9335.67325143644, 9511.904880951102, 9592.856107158537, 9605.231581473325, 9495.05049495045, 9499.952500237454, 9588.424694518351, 9603.03969603062, 9638.95180524093, 6371.108044873814, 6885.0, 7069.540479868792, 7418.258174182539, 7786.065672119382, 7782.610869456391, 7892.0924093729955, 7919.16848730875, 7962.363010959225, 7969.0, 6797.966010169917, 6971.7211311549, 6989.720411183495, 7034.437245020488, 7254.746083887249, 6897.7240910363025, 6917.308269173042, 6976.895346569704, 7035.542689725152, 7115.2528984455885, 6596.208454985433, 6647.567908085959, 6670.66646667655, 6674.632895190617, 6696.062551242732, 4924.926126108183, 4967.180415231446, 4967.677100988424, 4976.054549635558, 5043.823466178666, 4892.339534162985, 5106.361704786902, 5150.639455238097, 5169.327987361619, 5234.476552344735], "value": 4417.211363532586, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [332.14331884764164, 333.11723931581304, 339.97497544902126, 340.93863104641184, 342.1122187922342, 5606.299212598426, 5669.319681638204, 5707.172459993299, 5717.714114294289, 5718.428157184279, 5549.36293793331, 5559.638623489471, 5579.246801681772, 5587.832365029046, 5604.719764011804, 4153.563875793036, 4199.7690127043, 4292.012837047481, 4338.544452832454, 4342.869713908588, 4294.613484786369, 4302.97848510757, 4327.697061205717, 4329.480462344507, 4329.631981281595, 4291.098869237464, 4332.675049371294, 4363.978180109095, 4374.0, 4380.123975204956, 4174.436451079111, 4280.892977675552, 4281.681696685078, 4303.548127446636, 4322.200392927319, 3771.7741733936305, 3772.2832661794173, 3779.168582911755, 3783.0895397823924, 3787.1478917243676, 5417.993013877296, 5431.511163995259, 5455.1271796512365, 5475.890482190373, 5490.396056433789, 4895.485973972753, 4943.209086546171, 4954.752262386866, 4964.453910069889, 5013.197888337885, 5799.0, 5825.388334224887, 5844.655729182269, 5853.068487399148, 5863.736131874076, 4210.726302790309, 4217.325227963511, 4230.471191101113, 4244.639205667522, 4253.276942919681, 5832.358440571534, 6063.150319349943, 6084.939150608481, 6099.57302988791, 6140.723667434976, 4311.318585751559, 4319.740815551077, 4321.3301938199, 4336.349547567827, 4348.956510434855, 4345.630621397217, 4353.085851971058, 4360.236958532244, 4380.824767009284, 4384.978075109604, 4820.638452116105, 4953.1332016896895, 4962.181240095416, 4971.6271279654175, 5041.319421878073, 5847.0, 5863.442972917651, 5886.0, 5889.263842019747, 5914.9704251479325, 1483.8367779544242, 1499.482678475924, 1501.2418728542016, 1519.8328183899762, 1526.7938828258043, 966.3863446711389, 991.1575161113141, 1004.5630150884389, 1021.6373187518473, 1025.564135242519, 5628.0, 5648.293963254593, 5654.4062873398525, 5677.403872593401, 5735.827925162252, 5940.851478712981, 5966.552508561876, 5992.880142397127, 6067.787627433018, 6091.360407157184, 5303.496167864047, 5577.581681373832, 5579.442055794388, 5590.636608620427, 5597.384287728347, 3143.795653282529, 3205.3108581655056, 3243.1243564237993, 3261.4292498812615, 3264.5919260092487, 5967.16459695643, 6138.570300079041, 6140.907886381708, 6141.0, 6151.907721384183, 6073.7245178513, 6088.325710429667, 6095.817125486243, 6134.15975207436, 6163.1679723237685, 5939.930812453714, 6107.725152368154, 6128.724207410677, 6170.598911070766, 6213.782517611952, 5913.911291330547, 5991.970040149771, 6014.8195554133445, 6074.483668888194, 6101.139152558512, 5924.548485620878, 5983.820485385445, 6001.639901605918, 6004.309504407049, 6053.818385448443, 5842.269716285465, 6082.36135205797, 6118.0, 6128.877422451436, 6183.721732521957, 4200.642945349679, 4204.51648060477, 4210.59999300066, 4224.619784219435, 4226.5418430641375, 5768.451997060272, 5770.0, 5939.613925094855, 5956.26012034469, 5985.0, 5828.59199856006, 5850.94149058504, 5899.882002360015, 5905.734241959036, 5918.704064796829, 5614.63504872182, 5811.157382179645, 5861.912071319019, 5899.587028907935, 5902.173695682522, 5724.341700704473, 5758.740856661544, 5759.222504961776, 5774.162746401832, 5806.0, 5883.852903677271, 5899.793507227227, 5949.137375080502, 5960.493358064613, 5984.491318237999, 5575.275214222125, 5801.506871915934, 5830.941690583039, 5833.416658334133, 5907.734151963086], "value": 4459.544627924248, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [646.1664452855813, 710.4281053751728, 739.4823623463577, 829.4401279136581, 844.611478719789, 14907.32917018734, 15681.29434175462, 15872.603184920368, 15959.361625534964, 15970.680586388266, 14985.550433487013, 15271.6945661087, 15293.617659558517, 15314.234288285568, 15326.08043517387, 669.7220653428822, 789.3842802613941, 795.2326005404783, 811.7118422959853, 814.242754238558, 820.7619790260848, 822.5393779483478, 824.9793755156109, 825.2036784502953, 827.4001349021971, 870.3081050564784, 872.6029656506274, 872.6116877989298, 872.8254349130168, 874.0167311774254, 861.7759382560516, 862.4609618988133, 864.3344624639025, 865.3812524045306, 869.6347534035721, 628.8302158417248, 634.6477704873794, 635.202820460324, 635.2948227467507, 635.3106879036205, 14709.779353309708, 14869.256537173098, 14874.479393221185, 14927.925360373238, 14937.477188298357, 13804.585862424143, 13954.720905581831, 14015.50945716895, 14132.434702611883, 14216.14703117806, 11845.0, 12004.69988250292, 12021.51913923442, 12060.095492838072, 12071.577494787729, 3976.5029371328583, 3996.9200615987806, 4014.959850401488, 4032.0, 4148.377743338493, 62139.0, 65494.0, 66441.66779166121, 72954.63522682406, 74364.0, 10744.892551074388, 10848.132149428027, 10853.891461085446, 10936.0, 11043.447827608587, 19716.507087322643, 19790.505237368892, 19814.900925495567, 19817.405477835688, 20021.799782002287, 8433.578321084044, 8508.02157751854, 8514.0, 8577.228049475452, 8753.518556479328, 4617.468991066004, 4744.857654270378, 4888.535589119028, 4993.0, 5016.54851063406, 3558.217192217708, 3702.148505843671, 3704.4443333499653, 3709.0912726382207, 3725.2549490102087, 608.6865264388844, 620.6245221640843, 631.8420394901275, 634.7397566997508, 654.5156584127807, 694.5103701890155, 698.6760089630122, 731.3564063624083, 733.2410954662006, 743.5204293230836, 9882.407055576545, 10023.69928902134, 10027.448490332956, 10287.0, 10397.688069357931, 696.7039008421502, 705.1784670858495, 708.1572928215408, 711.9359257666835, 724.6883839948767, 4959.553640172402, 4963.6277279204205, 4974.353334066621, 4990.3762029746285, 5026.371703537058, 116968.41515792366, 117475.0, 117805.41097294459, 118271.40864295796, 120021.39989300173, 91218.54390728004, 94392.0, 94836.0, 94889.0, 95255.0, 84033.57983210045, 87971.0, 88178.0, 88261.0, 89041.55479222692, 8809.383343165917, 8883.156100170474, 8985.820283594423, 9034.27725781949, 9354.71935841926, 48619.75690121527, 48741.75629121832, 49655.75172124261, 50380.49619503905, 50760.23859642182, 23625.0, 23776.64335034941, 32082.0, 67570.66214668895, 74612.0, 12923.806142908052, 13115.606531804062, 13222.735545288848, 13439.260840653858, 13630.727385452037, 14348.995570309979, 15429.305681244146, 15521.844781552492, 16126.67746645084, 16428.096454695107, 13142.80285795733, 13143.474261029452, 13558.593242202749, 14532.782008269673, 15395.3072111753, 13913.652158696113, 13977.58067257984, 14625.0, 14736.189509577076, 15147.697046059238, 13166.539171128965, 13579.185248885098, 13635.795463067863, 13781.724365512835, 14091.577252682437, 11136.276142050741, 11495.195336326711, 11593.188476806543, 11685.415729213335, 11700.180987330805, 11802.291862488279, 11817.586384476503, 11949.64151075469, 12162.878371216175, 12176.57381991626], "value": 7495.829748028549, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1547.8, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 107.0, 112.0, 112.0, 112.0, 113.0, 111.0, 115.0, 114.0, 111.0], "value": 111.9, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [158.0, 129.0, 156.0, 181.0, 128.0, 162.0, 151.0, 127.0, 181.0, 135.0], "value": 150.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 164.0, 167.0, 164.0, 167.0, 173.0, 166.0, 162.0, 163.0, 163.0], "value": 165.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 75.0, 169.0, 76.0, 75.0, 75.0, 75.0, 178.0, 75.0], "value": 94.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 85.0, 147.0, 86.0, 84.0, 86.0, 138.0, 85.0, 94.0, 147.0], "value": 103.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 120.0, 118.0, 117.0, 117.0, 118.0, 118.0, 118.0], "value": 117.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 146.0, 146.0, 149.0, 147.0, 147.0, 147.0, 151.0, 150.0, 150.0], "value": 148.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 95.0, 95.0, 95.0, 96.0, 96.0, 95.0, 97.0, 96.0, 97.0], "value": 95.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 54.0, 55.0, 53.0, 60.0, 56.0, 54.0, 55.0, 55.0, 54.0], "value": 55.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 61.0, 61.0, 61.0, 63.0, 62.0, 62.0, 63.0, 61.0, 62.0], "value": 61.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 80.0, 79.0, 87.0, 81.0, 83.0, 90.0, 82.0, 111.0, 82.0], "value": 85.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [131.0, 124.0, 124.0, 122.0, 135.0, 131.0, 139.0, 131.0, 126.0, 133.0], "value": 129.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [168.0, 165.0, 162.0, 161.0, 164.0, 162.0, 164.0, 165.0, 158.0, 161.0], "value": 163.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 63.0, 64.0, 64.0, 71.0, 64.0, 63.0, 62.0, 69.0, 62.0], "value": 64.5, "unit": "score"}]}]} 07:40:46 INFO - Return code: 0 07:40:46 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 07:40:46 ERROR - # TBPL SUCCESS # 07:40:46 INFO - Running post-action listener: _resource_record_post_action 07:40:46 INFO - ##### 07:40:46 INFO - ##### Finished run-tests step (success) 07:40:46 INFO - ##### 07:40:46 INFO - Running post-run listener: _resource_record_post_run 07:40:46 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 2363392; Write bytes: 549941248; Read time: 1368; Write time: 572416 07:40:46 INFO - TinderboxPrint: CPU usage
13.4% 07:40:46 INFO - TinderboxPrint: I/O read bytes / time
2,363,392 / 1,368 07:40:46 INFO - TinderboxPrint: I/O write bytes / time
549,941,248 / 572,416 07:40:46 INFO - TinderboxPrint: CPU idle
8,227.1 (86.5%) 07:40:46 INFO - TinderboxPrint: CPU user
1,223.7 (12.9%) 07:40:46 INFO - TinderboxPrint: Swap in / out
0 / 0 07:40:46 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 255713280; Read time: 0; Write time: 365832 07:40:47 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 2363392; Write bytes: 294227968; Read time: 1368; Write time: 206584 07:40:47 INFO - Running post-run listener: _upload_blobber_files 07:40:47 INFO - Blob upload gear active. 07:40:47 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 07:40:47 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 07:40:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Inbound', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 07:40:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Inbound -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 07:40:47 INFO - (blobuploader) - INFO - Open directory for files ... 07:40:47 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 07:40:47 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:40:47 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:40:48 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 07:40:48 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:40:48 INFO - (blobuploader) - INFO - Done attempting. 07:40:48 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 07:40:48 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:40:48 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:40:52 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 07:40:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:40:52 INFO - (blobuploader) - INFO - Done attempting. 07:40:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 07:40:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:40:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:40:53 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 07:40:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:40:53 INFO - (blobuploader) - INFO - Done attempting. 07:40:53 INFO - (blobuploader) - INFO - Iteration through files over. 07:40:53 INFO - Return code: 0 07:40:53 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 07:40:53 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 07:40:53 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/f54e8ef3c91cbf4a04aa63c905fafc9ad5ab72de9531c58b5bff36563f6b0a1182b00444ee81ed84ed30d1ea382c75d96fbce1607f5ef5ac088b023ca88c4ec2", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/816bfce668dab2395ef76759b3f2ac98c53fc389cd7fe4ff7c6967f2bf860be7b0c2417d8bd5ab539930f20bc4ec7d300cc7a8b4dd7702241aadc11d9956c618", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/88c637267abe4a094b34d121bfd3c5b9a8efae4d928d07bd4776c8af6e7f9ebb302a60734f600d62ccec56877da289e0aefdcfb89c8d682355c463d00bcc3340"} 07:40:53 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 07:40:53 INFO - Writing to file /builds/slave/test/properties/blobber_files 07:40:53 INFO - Contents: 07:40:53 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/f54e8ef3c91cbf4a04aa63c905fafc9ad5ab72de9531c58b5bff36563f6b0a1182b00444ee81ed84ed30d1ea382c75d96fbce1607f5ef5ac088b023ca88c4ec2", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/816bfce668dab2395ef76759b3f2ac98c53fc389cd7fe4ff7c6967f2bf860be7b0c2417d8bd5ab539930f20bc4ec7d300cc7a8b4dd7702241aadc11d9956c618", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/88c637267abe4a094b34d121bfd3c5b9a8efae4d928d07bd4776c8af6e7f9ebb302a60734f600d62ccec56877da289e0aefdcfb89c8d682355c463d00bcc3340"} 07:40:53 INFO - Running post-run listener: copy_logs_to_upload_dir 07:40:53 INFO - Copying logs to upload dir... 07:40:53 INFO - mkdir: /builds/slave/test/build/upload/logs 07:40:53 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1234.512626 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2016-06-16 07:40:51.131806) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-16 07:40:51.135011) ========= 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=97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/f54e8ef3c91cbf4a04aa63c905fafc9ad5ab72de9531c58b5bff36563f6b0a1182b00444ee81ed84ed30d1ea382c75d96fbce1607f5ef5ac088b023ca88c4ec2", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/816bfce668dab2395ef76759b3f2ac98c53fc389cd7fe4ff7c6967f2bf860be7b0c2417d8bd5ab539930f20bc4ec7d300cc7a8b4dd7702241aadc11d9956c618", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/88c637267abe4a094b34d121bfd3c5b9a8efae4d928d07bd4776c8af6e7f9ebb302a60734f600d62ccec56877da289e0aefdcfb89c8d682355c463d00bcc3340"} build_url:https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011356 build_url: 'https://queue.taskcluster.net/v1/task/L3dwgPn_SZiDbUurYp-_Lg/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/Mozilla-Inbound/sha512/f54e8ef3c91cbf4a04aa63c905fafc9ad5ab72de9531c58b5bff36563f6b0a1182b00444ee81ed84ed30d1ea382c75d96fbce1607f5ef5ac088b023ca88c4ec2", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/816bfce668dab2395ef76759b3f2ac98c53fc389cd7fe4ff7c6967f2bf860be7b0c2417d8bd5ab539930f20bc4ec7d300cc7a8b4dd7702241aadc11d9956c618", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/88c637267abe4a094b34d121bfd3c5b9a8efae4d928d07bd4776c8af6e7f9ebb302a60734f600d62ccec56877da289e0aefdcfb89c8d682355c463d00bcc3340"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-16 07:40:51.162120) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 07:40:51.162426) ========= 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=97facb8ba2ac28944cc45e6b000001d4-1466086816.746522-157799700 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004586 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-16 07:40:51.244341) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-16 07:40:51.244658) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-16 07:40:51.244942) ========= ========= Total master_lag: 0.16 =========