builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-031 starttime: 1467874505.43 results: success (0) buildid: 20160706211421 builduid: 4a023f207eb44b7eb774067a8831ed6f revision: bf67cbd8360a4249d6bfa0d2c256ec4291e10fc3 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:05.427260) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:05.427642) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:05.427923) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:05.477243) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:05.477503) ========= 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=db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-06 23:55:05-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 64.7M=0s 2016-07-06 23:55:05 (64.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.455013 ========= master_lag: 0.06 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:05.987633) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:05.987997) ========= 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=db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018154 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:06.035290) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:06.035663) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev bf67cbd8360a4249d6bfa0d2c256ec4291e10fc3 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev bf67cbd8360a4249d6bfa0d2c256ec4291e10fc3 --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=db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-06 23:55:06,098 truncating revision to first 12 chars 2016-07-06 23:55:06,098 Setting DEBUG logging. 2016-07-06 23:55:06,098 attempt 1/10 2016-07-06 23:55:06,098 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/bf67cbd8360a?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-06 23:55:06,402 unpacking tar archive at: mozilla-aurora-bf67cbd8360a/testing/mozharness/ program finished with exit code 0 elapsedTime=0.654542 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:06.705459) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:06.705824) ========= script_repo_revision: bf67cbd8360a4249d6bfa0d2c256ec4291e10fc3 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:06.706265) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:06.706572) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-06 23:55:06.717632) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-07-06 23:55:06.717955) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 23:55:06 INFO - MultiFileLogger online at 20160706 23:55:06 in /builds/slave/test 23:55:06 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 23:55:06 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 23:55:06 INFO - {'append_to_log': False, 23:55:06 INFO - 'base_work_dir': '/builds/slave/test', 23:55:06 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 23:55:06 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 23:55:06 INFO - 'branch': 'Mozilla-Aurora', 23:55:06 INFO - 'buildbot_json_path': 'buildprops.json', 23:55:06 INFO - 'config_files': ('talos/linux_config.py',), 23:55:06 INFO - 'default_actions': ('clobber', 23:55:06 INFO - 'read-buildbot-config', 23:55:06 INFO - 'download-and-extract', 23:55:06 INFO - 'populate-webroot', 23:55:06 INFO - 'create-virtualenv', 23:55:06 INFO - 'install', 23:55:06 INFO - 'run-tests'), 23:55:06 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 23:55:06 INFO - 'download_minidump_stackwalk': True, 23:55:06 INFO - 'download_symbols': 'ondemand', 23:55:06 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 23:55:06 INFO - 'tooltool.py': '/tools/tooltool.py', 23:55:06 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 23:55:06 INFO - '/tools/misc-python/virtualenv.py')}, 23:55:06 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 23:55:06 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 23:55:06 INFO - 'installer_path': 'installer.exe', 23:55:06 INFO - 'log_level': 'info', 23:55:06 INFO - 'log_name': 'talos', 23:55:06 INFO - 'log_to_console': True, 23:55:06 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 23:55:06 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 23:55:06 INFO - 'opt_config_files': (), 23:55:06 INFO - 'pip_index': False, 23:55:06 INFO - 'sps_profile': False, 23:55:06 INFO - 'sps_profile_interval': 0, 23:55:06 INFO - 'suite': 'dromaeojs-e10s', 23:55:06 INFO - 'system_bits': '32', 23:55:06 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 23:55:06 INFO - 'title': 'talos-linux64-ix-031', 23:55:06 INFO - 'tooltool_cache': '/builds/tooltool_cache', 23:55:06 INFO - 'use_talos_json': True, 23:55:06 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 23:55:06 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 23:55:06 INFO - 'work_dir': 'build'} 23:55:06 INFO - ##### 23:55:06 INFO - ##### Running clobber step. 23:55:06 INFO - ##### 23:55:06 INFO - Running pre-action listener: _resource_record_pre_action 23:55:06 INFO - Running main action method: clobber 23:55:06 INFO - rmtree: /builds/slave/test/build 23:55:06 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 23:55:07 INFO - Running post-action listener: _resource_record_post_action 23:55:07 INFO - ##### 23:55:07 INFO - ##### Finished clobber step (success) 23:55:07 INFO - ##### 23:55:07 INFO - ##### 23:55:07 INFO - ##### Running read-buildbot-config step. 23:55:07 INFO - ##### 23:55:07 INFO - Running pre-action listener: _resource_record_pre_action 23:55:07 INFO - Running main action method: read_buildbot_config 23:55:07 INFO - Using buildbot properties: 23:55:07 INFO - { 23:55:07 INFO - "project": "", 23:55:07 INFO - "product": "firefox", 23:55:07 INFO - "script_repo_revision": "production", 23:55:07 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 23:55:07 INFO - "repository": "", 23:55:07 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 23:55:07 INFO - "buildid": "20160706211421", 23:55:07 INFO - "pgo_build": "True", 23:55:07 INFO - "basedir": "/builds/slave/test", 23:55:07 INFO - "buildnumber": 431, 23:55:07 INFO - "slavename": "talos-linux64-ix-031", 23:55:07 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 23:55:07 INFO - "platform": "ubuntu64_hw", 23:55:07 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 23:55:07 INFO - "branch": "mozilla-aurora", 23:55:07 INFO - "repo_path": "releases/mozilla-aurora", 23:55:07 INFO - "revision": "bf67cbd8360a4249d6bfa0d2c256ec4291e10fc3", 23:55:07 INFO - "stage_platform": "linux64-pgo", 23:55:07 INFO - "builduid": "4a023f207eb44b7eb774067a8831ed6f", 23:55:07 INFO - "slavebuilddir": "test" 23:55:07 INFO - } 23:55:07 INFO - Found installer url https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2. 23:55:07 INFO - Running post-action listener: _resource_record_post_action 23:55:07 INFO - ##### 23:55:07 INFO - ##### Finished read-buildbot-config step (success) 23:55:07 INFO - ##### 23:55:07 INFO - ##### 23:55:07 INFO - ##### Running download-and-extract step. 23:55:07 INFO - ##### 23:55:07 INFO - Running pre-action listener: _resource_record_pre_action 23:55:07 INFO - Running main action method: download_and_extract 23:55:07 INFO - mkdir: /builds/slave/test/build/tests 23:55:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:07 INFO - https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 23:55:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json 23:55:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json 23:55:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json 23:55:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 23:55:12 INFO - Downloaded 1361 bytes. 23:55:12 INFO - Reading from file /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json 23:55:12 INFO - Using the following test package requirements: 23:55:12 INFO - {u'common': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'], 23:55:12 INFO - u'cppunittest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:55:12 INFO - u'firefox-49.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 23:55:12 INFO - u'gtest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:55:12 INFO - u'firefox-49.0a2.en-US.linux-x86_64.gtest.tests.zip'], 23:55:12 INFO - u'jittest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:55:12 INFO - u'jsshell-linux-x86_64.zip'], 23:55:12 INFO - u'mochitest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:55:12 INFO - u'firefox-49.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 23:55:12 INFO - u'mozbase': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'], 23:55:12 INFO - u'reftest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:55:12 INFO - u'firefox-49.0a2.en-US.linux-x86_64.reftest.tests.zip'], 23:55:12 INFO - u'talos': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:55:12 INFO - u'firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip'], 23:55:12 INFO - u'web-platform': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:55:12 INFO - u'firefox-49.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 23:55:12 INFO - u'xpcshell': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 23:55:12 INFO - u'firefox-49.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 23:55:12 INFO - Downloading packages: [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 23:55:12 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')]} 23:55:12 INFO - https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:55:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 23:55:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 23:55:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 23:55:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 23:55:13 INFO - Downloaded 24526481 bytes. 23:55:13 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 23:55:13 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 23:55:14 INFO - Return code: 0 23:55:14 INFO - Downloading packages: [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 23:55:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:14 INFO - https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 23:55:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 23:55:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 23:55:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 23:55:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 23:55:18 INFO - Downloaded 24526481 bytes. 23:55:18 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 23:55:18 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 23:55:20 INFO - Return code: 0 23:55: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')]} 23:55:20 INFO - https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 23:55:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip 23:55:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip 23:55:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip 23:55:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 23:55:20 INFO - Downloaded 10833369 bytes. 23:55:20 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 23:55:20 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 23:55:21 INFO - Return code: 0 23:55:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:21 INFO - https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 23:55:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 23:55:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 23:55:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 23:55:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 23:55:22 INFO - Downloaded 63636050 bytes. 23:55:22 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 23:55:22 INFO - mkdir: /builds/slave/test/properties 23:55:22 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 23:55:22 INFO - Writing to file /builds/slave/test/properties/build_url 23:55:22 INFO - Contents: 23:55:22 INFO - build_url:https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 23:55:23 INFO - Running post-action listener: _resource_record_post_action 23:55:23 INFO - Running post-action listener: set_extra_try_arguments 23:55:23 INFO - ##### 23:55:23 INFO - ##### Finished download-and-extract step (success) 23:55:23 INFO - ##### 23:55:23 INFO - ##### 23:55:23 INFO - ##### Running populate-webroot step. 23:55:23 INFO - ##### 23:55:23 INFO - Running pre-action listener: _resource_record_pre_action 23:55:23 INFO - Running main action method: populate_webroot 23:55:23 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 23:55:23 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 23:55:23 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 23:55:23 INFO - '--tppagecycles', 23:55:23 INFO - '7'], 23:55:23 INFO - 'tests': ['tsvgm']}}, 23:55:23 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 23:55:23 INFO - 'tests': ['tresize', 'tcanvasmark']}, 23:55:23 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 23:55:23 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 23:55:23 INFO - 'tests': ['dromaeo_css', 'kraken']}, 23:55:23 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 23:55:23 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:55:23 INFO - 'talos_options': ['--disable-e10s'], 23:55:23 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:55:23 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:55:23 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 23:55:23 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:55:23 INFO - 'talos_options': ['--disable-e10s'], 23:55:23 INFO - 'tests': ['damp', 'tps']}, 23:55:23 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:55:23 INFO - 'tests': ['damp', 'tps']}, 23:55:23 INFO - 'g3': {'talos_options': ['--disable-e10s'], 23:55:23 INFO - 'tests': ['dromaeo_dom']}, 23:55:23 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 23:55:23 INFO - 'other': {'talos_options': ['--disable-e10s'], 23:55:23 INFO - 'tests': ['a11yr', 23:55:23 INFO - 'ts_paint', 23:55:23 INFO - 'tpaint', 23:55:23 INFO - 'sessionrestore', 23:55:23 INFO - 'sessionrestore_no_auto_restore', 23:55:23 INFO - 'tabpaint']}, 23:55:23 INFO - 'other-e10s': {'tests': ['a11yr', 23:55:23 INFO - 'ts_paint', 23:55:23 INFO - 'tpaint', 23:55:23 INFO - 'sessionrestore', 23:55:23 INFO - 'sessionrestore_no_auto_restore', 23:55:23 INFO - 'tabpaint']}, 23:55:23 INFO - 'other-e10s_l64': {'tests': ['a11yr', 23:55:23 INFO - 'ts_paint', 23:55:23 INFO - 'tpaint', 23:55:23 INFO - 'sessionrestore', 23:55:23 INFO - 'sessionrestore_no_auto_restore', 23:55:23 INFO - 'tabpaint']}, 23:55:23 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 23:55:23 INFO - 'ts_paint', 23:55:23 INFO - 'tpaint', 23:55:23 INFO - 'sessionrestore', 23:55:23 INFO - 'sessionrestore_no_auto_restore', 23:55:23 INFO - 'tabpaint']}, 23:55:23 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 23:55:23 INFO - 'tests': ['a11yr', 23:55:23 INFO - 'ts_paint', 23:55:23 INFO - 'tpaint', 23:55:23 INFO - 'sessionrestore', 23:55:23 INFO - 'sessionrestore_no_auto_restore', 23:55:23 INFO - 'tabpaint']}, 23:55:23 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 23:55:23 INFO - 'tests': ['a11yr', 23:55:23 INFO - 'ts_paint', 23:55:23 INFO - 'tpaint', 23:55:23 INFO - 'sessionrestore', 23:55:23 INFO - 'sessionrestore_no_auto_restore', 23:55:23 INFO - 'tabpaint']}, 23:55:23 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 23:55:23 INFO - 'tests': ['tsvgx', 23:55:23 INFO - 'tsvgr_opacity', 23:55:23 INFO - 'tart', 23:55:23 INFO - 'tscrollx', 23:55:23 INFO - 'cart']}, 23:55:23 INFO - 'svgr-e10s': {'tests': ['tsvgx', 23:55:23 INFO - 'tsvgr_opacity', 23:55:23 INFO - 'tart', 23:55:23 INFO - 'tscrollx', 23:55:23 INFO - 'cart']}, 23:55:23 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:55:23 INFO - 'talos_options': ['--disable-e10s'], 23:55:23 INFO - 'tests': ['tp5o']}, 23:55:23 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:55:23 INFO - 'tests': ['tp5o']}, 23:55:23 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:55:23 INFO - 'talos_options': ['--disable-e10s', 23:55:23 INFO - '--xperf_path', 23:55:23 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:55:23 INFO - 'tests': ['tp5n']}, 23:55:23 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 23:55:23 INFO - 'talos_options': ['--xperf_path', 23:55:23 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 23:55:23 INFO - 'tests': ['tp5n']}}, 23:55:23 INFO - 'talos.zip': {'path': '', 23:55:23 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 23:55:23 INFO - Running post-action listener: _resource_record_post_action 23:55:23 INFO - ##### 23:55:23 INFO - ##### Finished populate-webroot step (success) 23:55:23 INFO - ##### 23:55:23 INFO - ##### 23:55:23 INFO - ##### Running create-virtualenv step. 23:55:23 INFO - ##### 23:55:23 INFO - Running pre-action listener: _resource_record_pre_action 23:55:23 INFO - Running main action method: create_virtualenv 23:55:23 INFO - Creating virtualenv /builds/slave/test/build/venv 23:55:23 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 23:55:23 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 23:55:23 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 23:55:23 INFO - Using real prefix '/usr' 23:55:23 INFO - New python executable in /builds/slave/test/build/venv/bin/python 23:55:24 INFO - Installing distribute.............................................................................................................................................................................................done. 23:55:26 INFO - Installing pip.................done. 23:55:26 INFO - Return code: 0 23:55:26 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 23:55: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')]} 23:55:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:55:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55: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')]} 23:55:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:55:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:26 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f6301138f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1575350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16041c0>, '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 0x16050c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1605550>, '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': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', '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 23:55:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 23:55:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 23:55:26 INFO - Using env: {'DISPLAY': ':0', 23:55:26 INFO - 'HOME': '/home/cltbld', 23:55:26 INFO - 'LANG': 'en_US.UTF-8', 23:55:26 INFO - 'LANGUAGE': 'en_US:en', 23:55:26 INFO - 'LOGNAME': 'cltbld', 23:55:26 INFO - 'MAIL': '/var/mail/cltbld', 23:55:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:55:26 INFO - 'MOZ_NO_REMOTE': '1', 23:55:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:55:26 INFO - 'NO_EM_RESTART': '1', 23:55:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:55:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:55:26 INFO - 'PWD': '/builds/slave/test', 23:55:26 INFO - 'SHELL': '/bin/bash', 23:55:26 INFO - 'SHLVL': '1', 23:55:26 INFO - 'TERM': 'linux', 23:55:26 INFO - 'TMOUT': '86400', 23:55:26 INFO - 'USER': 'cltbld', 23:55:26 INFO - 'XDG_SESSION_COOKIE': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', 23:55:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:55:26 INFO - '_': '/tools/buildbot/bin/python'} 23:55:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:55:26 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 23:55:26 INFO - Cleaning up... 23:55:26 INFO - Return code: 0 23:55:26 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 23:55: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')]} 23:55:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:55:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55: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')]} 23:55:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:55:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:26 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f6301138f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1575350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16041c0>, '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 0x16050c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1605550>, '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': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', '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 23:55:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 23:55:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 23:55:26 INFO - Using env: {'DISPLAY': ':0', 23:55:26 INFO - 'HOME': '/home/cltbld', 23:55:26 INFO - 'LANG': 'en_US.UTF-8', 23:55:26 INFO - 'LANGUAGE': 'en_US:en', 23:55:26 INFO - 'LOGNAME': 'cltbld', 23:55:26 INFO - 'MAIL': '/var/mail/cltbld', 23:55:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:55:26 INFO - 'MOZ_NO_REMOTE': '1', 23:55:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:55:26 INFO - 'NO_EM_RESTART': '1', 23:55:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:55:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:55:26 INFO - 'PWD': '/builds/slave/test', 23:55:26 INFO - 'SHELL': '/bin/bash', 23:55:26 INFO - 'SHLVL': '1', 23:55:26 INFO - 'TERM': 'linux', 23:55:26 INFO - 'TMOUT': '86400', 23:55:26 INFO - 'USER': 'cltbld', 23:55:26 INFO - 'XDG_SESSION_COOKIE': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', 23:55:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:55:26 INFO - '_': '/tools/buildbot/bin/python'} 23:55:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:55:26 INFO - Downloading/unpacking psutil>=3.1.1 23:55:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:55:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:55:26 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:55:26 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:55:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:55:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:55:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 23:55:28 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:55:28 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:55:28 INFO - Installing collected packages: psutil 23:55:28 INFO - Running setup.py install for psutil 23:55:28 INFO - building 'psutil._psutil_linux' extension 23:55:28 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 23:55:29 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 23:55:29 INFO - building 'psutil._psutil_posix' extension 23:55:29 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 23:55:30 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 23:55:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 23:55:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 23:55:30 INFO - Successfully installed psutil 23:55:30 INFO - Cleaning up... 23:55:30 INFO - Return code: 0 23:55:30 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 23:55:30 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')]} 23:55:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:55:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:30 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')]} 23:55:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:55:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:30 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 0x7f6301138f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1575350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16041c0>, '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 0x16050c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1605550>, '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': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', '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 23:55:30 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 23:55:30 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 23:55:30 INFO - Using env: {'DISPLAY': ':0', 23:55:30 INFO - 'HOME': '/home/cltbld', 23:55:30 INFO - 'LANG': 'en_US.UTF-8', 23:55:30 INFO - 'LANGUAGE': 'en_US:en', 23:55:30 INFO - 'LOGNAME': 'cltbld', 23:55:30 INFO - 'MAIL': '/var/mail/cltbld', 23:55:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:55:30 INFO - 'MOZ_NO_REMOTE': '1', 23:55:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:55:30 INFO - 'NO_EM_RESTART': '1', 23:55:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:55:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:55:30 INFO - 'PWD': '/builds/slave/test', 23:55:30 INFO - 'SHELL': '/bin/bash', 23:55:30 INFO - 'SHLVL': '1', 23:55:30 INFO - 'TERM': 'linux', 23:55:30 INFO - 'TMOUT': '86400', 23:55:30 INFO - 'USER': 'cltbld', 23:55:30 INFO - 'XDG_SESSION_COOKIE': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', 23:55:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:55:30 INFO - '_': '/tools/buildbot/bin/python'} 23:55:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:55:30 INFO - Downloading/unpacking mozsystemmonitor==0.3 23:55:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:55:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:55:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:55:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:55:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:55:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:55:32 INFO - Downloading mozsystemmonitor-0.3.tar.gz 23:55:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 23:55:32 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 23:55:32 INFO - Installing collected packages: mozsystemmonitor 23:55:32 INFO - Running setup.py install for mozsystemmonitor 23:55:32 INFO - Successfully installed mozsystemmonitor 23:55:32 INFO - Cleaning up... 23:55:32 INFO - Return code: 0 23:55:32 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 23:55: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')]} 23:55:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:55:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55: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')]} 23:55:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:55:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55: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', '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 0x7f6301138f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1575350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16041c0>, '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 0x16050c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1605550>, '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': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', '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 23:55: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', 'jsonschema==2.5.1'] in /builds/slave/test/build 23:55: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 jsonschema==2.5.1 23:55:32 INFO - Using env: {'DISPLAY': ':0', 23:55:32 INFO - 'HOME': '/home/cltbld', 23:55:32 INFO - 'LANG': 'en_US.UTF-8', 23:55:32 INFO - 'LANGUAGE': 'en_US:en', 23:55:32 INFO - 'LOGNAME': 'cltbld', 23:55:32 INFO - 'MAIL': '/var/mail/cltbld', 23:55:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:55:32 INFO - 'MOZ_NO_REMOTE': '1', 23:55:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:55:32 INFO - 'NO_EM_RESTART': '1', 23:55:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:55:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:55:32 INFO - 'PWD': '/builds/slave/test', 23:55:32 INFO - 'SHELL': '/bin/bash', 23:55:32 INFO - 'SHLVL': '1', 23:55:32 INFO - 'TERM': 'linux', 23:55:32 INFO - 'TMOUT': '86400', 23:55:32 INFO - 'USER': 'cltbld', 23:55:32 INFO - 'XDG_SESSION_COOKIE': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', 23:55:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:55:32 INFO - '_': '/tools/buildbot/bin/python'} 23:55:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:55:32 INFO - Downloading/unpacking jsonschema==2.5.1 23:55: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 23:55: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 23:55: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 23:55: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 23:55: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 23:55: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 23:55:34 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 23:55:34 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 23:55: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 23:55: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 23:55: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 23:55: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 23:55: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 23:55: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 23:55:34 INFO - Downloading functools32-3.2.3-2.tar.gz 23:55:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 23:55:34 INFO - warning: no files found matching '*.txt' 23:55:34 INFO - no previously-included directories found matching 'build' 23:55:34 INFO - no previously-included directories found matching 'dist' 23:55:34 INFO - no previously-included directories found matching '.git*' 23:55:34 INFO - Installing collected packages: jsonschema, functools32 23:55:34 INFO - Running setup.py install for functools32 23:55:35 INFO - warning: no files found matching '*.txt' 23:55:35 INFO - no previously-included directories found matching 'build' 23:55:35 INFO - no previously-included directories found matching 'dist' 23:55:35 INFO - no previously-included directories found matching '.git*' 23:55:35 INFO - Successfully installed jsonschema functools32 23:55:35 INFO - Cleaning up... 23:55:35 INFO - Return code: 0 23:55:35 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 23:55:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:55:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:55:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f6301138f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1575350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16041c0>, '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 0x16050c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1605550>, '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': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', '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 23:55:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 23:55:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 23:55:35 INFO - Using env: {'DISPLAY': ':0', 23:55:35 INFO - 'HOME': '/home/cltbld', 23:55:35 INFO - 'LANG': 'en_US.UTF-8', 23:55:35 INFO - 'LANGUAGE': 'en_US:en', 23:55:35 INFO - 'LOGNAME': 'cltbld', 23:55:35 INFO - 'MAIL': '/var/mail/cltbld', 23:55:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:55:35 INFO - 'MOZ_NO_REMOTE': '1', 23:55:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:55:35 INFO - 'NO_EM_RESTART': '1', 23:55:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:55:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:55:35 INFO - 'PWD': '/builds/slave/test', 23:55:35 INFO - 'SHELL': '/bin/bash', 23:55:35 INFO - 'SHLVL': '1', 23:55:35 INFO - 'TERM': 'linux', 23:55:35 INFO - 'TMOUT': '86400', 23:55:35 INFO - 'USER': 'cltbld', 23:55:35 INFO - 'XDG_SESSION_COOKIE': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', 23:55:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:55:35 INFO - '_': '/tools/buildbot/bin/python'} 23:55:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:55:35 INFO - Downloading/unpacking blobuploader==1.2.4 23:55:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:55:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:55:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:55:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:55:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:55:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:55:37 INFO - Downloading blobuploader-1.2.4.tar.gz 23:55:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 23:55:37 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 23:55: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 23:55: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 23:55: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 23:55: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 23:55: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 23:55: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 23:55:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 23:55:37 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 23:55: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 23:55: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 23:55: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 23:55: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 23:55: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 23:55: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 23:55:37 INFO - Downloading docopt-0.6.1.tar.gz 23:55:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 23:55:37 INFO - Installing collected packages: blobuploader, requests, docopt 23:55:37 INFO - Running setup.py install for blobuploader 23:55:38 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 23:55:38 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 23:55:38 INFO - Running setup.py install for requests 23:55:38 INFO - Running setup.py install for docopt 23:55:38 INFO - Successfully installed blobuploader requests docopt 23:55:38 INFO - Cleaning up... 23:55:38 INFO - Return code: 0 23:55:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:55:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:55:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:55:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:38 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 0x7f6301138f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1575350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16041c0>, '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 0x16050c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1605550>, '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': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', '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 23:55:38 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 23:55:38 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 23:55:38 INFO - Using env: {'DISPLAY': ':0', 23:55:38 INFO - 'HOME': '/home/cltbld', 23:55:38 INFO - 'LANG': 'en_US.UTF-8', 23:55:38 INFO - 'LANGUAGE': 'en_US:en', 23:55:38 INFO - 'LOGNAME': 'cltbld', 23:55:38 INFO - 'MAIL': '/var/mail/cltbld', 23:55:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:55:38 INFO - 'MOZ_NO_REMOTE': '1', 23:55:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:55:38 INFO - 'NO_EM_RESTART': '1', 23:55:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:55:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:55:38 INFO - 'PWD': '/builds/slave/test', 23:55:38 INFO - 'SHELL': '/bin/bash', 23:55:38 INFO - 'SHLVL': '1', 23:55:38 INFO - 'TERM': 'linux', 23:55:38 INFO - 'TMOUT': '86400', 23:55:38 INFO - 'USER': 'cltbld', 23:55:38 INFO - 'XDG_SESSION_COOKIE': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', 23:55:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:55:38 INFO - '_': '/tools/buildbot/bin/python'} 23:55:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:55:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 23:55:38 INFO - Running setup.py (path:/tmp/pip-EAJri9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 23:55:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 23:55:38 INFO - Running setup.py (path:/tmp/pip-RZDUBj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 23:55:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 23:55:38 INFO - Running setup.py (path:/tmp/pip-cefhUo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 23:55:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 23:55:39 INFO - Running setup.py (path:/tmp/pip-xvOADe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 23:55:39 INFO - Running setup.py (path:/tmp/pip-at07Pr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 23:55:39 INFO - Running setup.py (path:/tmp/pip-ppXzP0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 23:55:39 INFO - Running setup.py (path:/tmp/pip-CkG48z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 23:55:39 INFO - Running setup.py (path:/tmp/pip-lOp0lH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 23:55:39 INFO - Running setup.py (path:/tmp/pip-0AgtEW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 23:55:39 INFO - Running setup.py (path:/tmp/pip-Fj4HzG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 23:55:39 INFO - Running setup.py (path:/tmp/pip-5Pv9rP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 23:55:39 INFO - Running setup.py (path:/tmp/pip-3iDZxr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 23:55:39 INFO - Running setup.py (path:/tmp/pip-mLMzdp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 23:55:39 INFO - Running setup.py (path:/tmp/pip-tA3vPO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 23:55:39 INFO - Running setup.py (path:/tmp/pip-iBZbXV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 23:55:39 INFO - Running setup.py (path:/tmp/pip-UgVWG4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 23:55:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 23:55:39 INFO - Running setup.py (path:/tmp/pip-cDjUe6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 23:55:40 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 23:55:40 INFO - Running setup.py install for manifestparser 23:55:40 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 23:55:40 INFO - Running setup.py install for mozcrash 23:55:40 INFO - Running setup.py install for mozdebug 23:55:40 INFO - Running setup.py install for mozdevice 23:55:40 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 23:55:40 INFO - Installing dm script to /builds/slave/test/build/venv/bin 23:55:40 INFO - Running setup.py install for mozfile 23:55:40 INFO - Running setup.py install for mozhttpd 23:55:40 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 23:55:40 INFO - Running setup.py install for mozinfo 23:55:40 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 23:55:40 INFO - Running setup.py install for mozInstall 23:55:40 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 23:55:40 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 23:55:40 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 23:55:40 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 23:55:40 INFO - Running setup.py install for mozleak 23:55:40 INFO - Running setup.py install for mozlog 23:55:41 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 23:55:41 INFO - Running setup.py install for moznetwork 23:55:41 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 23:55:41 INFO - Running setup.py install for mozprocess 23:55:41 INFO - Running setup.py install for mozprofile 23:55:41 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 23:55:41 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 23:55:41 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 23:55:41 INFO - Running setup.py install for mozrunner 23:55:41 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 23:55:41 INFO - Running setup.py install for mozscreenshot 23:55:41 INFO - Running setup.py install for moztest 23:55:41 INFO - Running setup.py install for mozversion 23:55:41 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 23:55:41 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 23:55:41 INFO - Cleaning up... 23:55:41 INFO - Return code: 0 23:55:41 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:55:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:55:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:55:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:41 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 0x7f6301138f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1575350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16041c0>, '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 0x16050c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1605550>, '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': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', '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 23:55:41 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 23:55:41 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 23:55:41 INFO - Using env: {'DISPLAY': ':0', 23:55:41 INFO - 'HOME': '/home/cltbld', 23:55:41 INFO - 'LANG': 'en_US.UTF-8', 23:55:41 INFO - 'LANGUAGE': 'en_US:en', 23:55:41 INFO - 'LOGNAME': 'cltbld', 23:55:41 INFO - 'MAIL': '/var/mail/cltbld', 23:55:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:55:41 INFO - 'MOZ_NO_REMOTE': '1', 23:55:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:55:41 INFO - 'NO_EM_RESTART': '1', 23:55:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:55:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:55:41 INFO - 'PWD': '/builds/slave/test', 23:55:41 INFO - 'SHELL': '/bin/bash', 23:55:41 INFO - 'SHLVL': '1', 23:55:41 INFO - 'TERM': 'linux', 23:55:41 INFO - 'TMOUT': '86400', 23:55:41 INFO - 'USER': 'cltbld', 23:55:41 INFO - 'XDG_SESSION_COOKIE': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', 23:55:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:55:41 INFO - '_': '/tools/buildbot/bin/python'} 23:55:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 23:55:42 INFO - Running setup.py (path:/tmp/pip-YbAfMO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 23:55:42 INFO - Running setup.py (path:/tmp/pip-mjFjop-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 23:55:42 INFO - Running setup.py (path:/tmp/pip-Ko8uSL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 23:55:42 INFO - Running setup.py (path:/tmp/pip-WvQDD3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 23:55:42 INFO - Running setup.py (path:/tmp/pip-stfhUW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 23:55:42 INFO - Running setup.py (path:/tmp/pip-D5CV_4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 23:55:42 INFO - Running setup.py (path:/tmp/pip-P0hfqa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 23:55:42 INFO - Running setup.py (path:/tmp/pip-QLxiZZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 23:55:42 INFO - Running setup.py (path:/tmp/pip-nRpRhQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 23:55:42 INFO - Running setup.py (path:/tmp/pip-1fSmii-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 23:55:42 INFO - Running setup.py (path:/tmp/pip-CWGQaE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 23:55:42 INFO - Running setup.py (path:/tmp/pip-93O0_L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 23:55:42 INFO - Running setup.py (path:/tmp/pip-6PB8rk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 23:55:42 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)) 23:55:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 23:55:42 INFO - Running setup.py (path:/tmp/pip-WDSxQB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 23:55:43 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)) 23:55:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 23:55:43 INFO - Running setup.py (path:/tmp/pip-QPSC8Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 23:55:43 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)) 23:55:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 23:55:43 INFO - Running setup.py (path:/tmp/pip-iU7Hiz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 23:55:43 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)) 23:55:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 23:55:43 INFO - Running setup.py (path:/tmp/pip-zhJeev-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 23:55:43 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)) 23:55:43 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)) 23:55:43 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)) 23:55:43 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)) 23:55:43 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)) 23:55:43 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)) 23:55:43 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 23:55:43 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 23:55:43 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 23:55:43 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 23:55:43 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 23:55:43 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 23:55:43 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 23:55:45 INFO - Downloading blessings-1.6.tar.gz 23:55:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 23:55:45 INFO - Installing collected packages: blessings 23:55:45 INFO - Running setup.py install for blessings 23:55:45 INFO - Successfully installed blessings 23:55:45 INFO - Cleaning up... 23:55:45 INFO - Return code: 0 23:55:45 INFO - Done creating virtualenv /builds/slave/test/build/venv. 23:55:45 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 23:55:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 23:55:45 INFO - Reading from file tmpfile_stdout 23:55:45 INFO - Current package versions: 23:55:45 INFO - argparse == 1.2.1 23:55:45 INFO - blessings == 1.6 23:55:45 INFO - blobuploader == 1.2.4 23:55:45 INFO - docopt == 0.6.1 23:55:45 INFO - functools32 == 3.2.3-2 23:55:45 INFO - jsonschema == 2.5.1 23:55:45 INFO - manifestparser == 1.1 23:55:45 INFO - mozInstall == 1.12 23:55:45 INFO - mozcrash == 0.17 23:55:45 INFO - mozdebug == 0.1 23:55:45 INFO - mozdevice == 0.48 23:55:45 INFO - mozfile == 1.2 23:55:45 INFO - mozhttpd == 0.7 23:55:45 INFO - mozinfo == 0.9 23:55:45 INFO - mozleak == 0.1 23:55:45 INFO - mozlog == 3.2 23:55:45 INFO - moznetwork == 0.27 23:55:45 INFO - mozprocess == 0.22 23:55:45 INFO - mozprofile == 0.28 23:55:45 INFO - mozrunner == 6.11 23:55:45 INFO - mozscreenshot == 0.1 23:55:45 INFO - mozsystemmonitor == 0.3 23:55:45 INFO - moztest == 0.7 23:55:45 INFO - mozversion == 1.4 23:55:45 INFO - psutil == 3.1.1 23:55:45 INFO - requests == 1.2.3 23:55:45 INFO - wsgiref == 0.1.2 23:55:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 23:55:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:55:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:55:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:45 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 0x7f6301138f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1575350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16041c0>, '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 0x16050c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1605550>, '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': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', '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 23:55:45 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 23:55:45 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 23:55:45 INFO - Using env: {'DISPLAY': ':0', 23:55:45 INFO - 'HOME': '/home/cltbld', 23:55:45 INFO - 'LANG': 'en_US.UTF-8', 23:55:45 INFO - 'LANGUAGE': 'en_US:en', 23:55:45 INFO - 'LOGNAME': 'cltbld', 23:55:45 INFO - 'MAIL': '/var/mail/cltbld', 23:55:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:55:45 INFO - 'MOZ_NO_REMOTE': '1', 23:55:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:55:45 INFO - 'NO_EM_RESTART': '1', 23:55:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:55:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:55:45 INFO - 'PWD': '/builds/slave/test', 23:55:45 INFO - 'SHELL': '/bin/bash', 23:55:45 INFO - 'SHLVL': '1', 23:55:45 INFO - 'TERM': 'linux', 23:55:45 INFO - 'TMOUT': '86400', 23:55:45 INFO - 'USER': 'cltbld', 23:55:45 INFO - 'XDG_SESSION_COOKIE': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', 23:55:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:55:45 INFO - '_': '/tools/buildbot/bin/python'} 23:55:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:55:45 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)) 23:55:45 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)) 23:55:45 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)) 23:55:45 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)) 23:55:45 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)) 23:55:45 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)) 23:55:45 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)) 23:55:45 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)) 23:55:45 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)) 23:55:45 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)) 23:55:45 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)) 23:55:45 INFO - Cleaning up... 23:55:45 INFO - Return code: 0 23:55:45 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 23:55:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:55:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 23:55:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:55:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:45 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 0x7f6301138f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1575350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16041c0>, '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 0x16050c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1605550>, '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': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', '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 23:55:45 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 23:55:45 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 23:55:45 INFO - Using env: {'DISPLAY': ':0', 23:55:45 INFO - 'HOME': '/home/cltbld', 23:55:45 INFO - 'LANG': 'en_US.UTF-8', 23:55:45 INFO - 'LANGUAGE': 'en_US:en', 23:55:45 INFO - 'LOGNAME': 'cltbld', 23:55:45 INFO - 'MAIL': '/var/mail/cltbld', 23:55:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:55:45 INFO - 'MOZ_NO_REMOTE': '1', 23:55:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:55:45 INFO - 'NO_EM_RESTART': '1', 23:55:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:55:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:55:45 INFO - 'PWD': '/builds/slave/test', 23:55:45 INFO - 'SHELL': '/bin/bash', 23:55:45 INFO - 'SHLVL': '1', 23:55:45 INFO - 'TERM': 'linux', 23:55:45 INFO - 'TMOUT': '86400', 23:55:45 INFO - 'USER': 'cltbld', 23:55:45 INFO - 'XDG_SESSION_COOKIE': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', 23:55:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:55:45 INFO - '_': '/tools/buildbot/bin/python'} 23:55:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:55:46 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 23:55:46 INFO - Cleaning up... 23:55:46 INFO - Return code: 0 23:55:46 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 23:55: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')]} 23:55:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 23:55:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55: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')]} 23:55:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 23:55:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 23:55:46 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 0x7f6301138f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1575350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16041c0>, '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 0x16050c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1605550>, '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': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', '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 23:55:46 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 23:55:46 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 23:55:46 INFO - Using env: {'DISPLAY': ':0', 23:55:46 INFO - 'HOME': '/home/cltbld', 23:55:46 INFO - 'LANG': 'en_US.UTF-8', 23:55:46 INFO - 'LANGUAGE': 'en_US:en', 23:55:46 INFO - 'LOGNAME': 'cltbld', 23:55:46 INFO - 'MAIL': '/var/mail/cltbld', 23:55:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:55:46 INFO - 'MOZ_NO_REMOTE': '1', 23:55:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:55:46 INFO - 'NO_EM_RESTART': '1', 23:55:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:55:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:55:46 INFO - 'PWD': '/builds/slave/test', 23:55:46 INFO - 'SHELL': '/bin/bash', 23:55:46 INFO - 'SHLVL': '1', 23:55:46 INFO - 'TERM': 'linux', 23:55:46 INFO - 'TMOUT': '86400', 23:55:46 INFO - 'USER': 'cltbld', 23:55:46 INFO - 'XDG_SESSION_COOKIE': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', 23:55:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:55:46 INFO - '_': '/tools/buildbot/bin/python'} 23:55:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 23:55:46 INFO - Downloading/unpacking flake8 23:55:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:55:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:55:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:55:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 23:55:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 23:55:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 23:55:48 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 23:55:48 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 23:55:48 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 23:55:48 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 23:55:48 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 23:55:48 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 23:55:48 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 23:55:48 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 23:55:48 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 23:55:48 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 23:55:48 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 23:55:48 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 23:55:48 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 23:55:48 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 23:55:48 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 23:55:48 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 23:55:48 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 23:55:48 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 23:55:48 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 23:55:48 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 23:55:48 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 23:55:48 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 23:55:48 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 23:55:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 23:55:48 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 23:55:48 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 23:55:48 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 23:55:48 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 23:55:48 INFO - no previously-included directories found matching 'docs/_build' 23:55:48 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 23:55:49 INFO - Running setup.py install for pep8 23:55:49 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 23:55:49 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 23:55:49 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 23:55:49 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 23:55:49 INFO - no previously-included directories found matching 'docs/_build' 23:55:49 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 23:55:49 INFO - Successfully installed flake8 mccabe pyflakes pep8 23:55:49 INFO - Cleaning up... 23:55:49 INFO - Return code: 0 23:55:49 INFO - Running post-action listener: _resource_record_post_action 23:55:49 INFO - Running post-action listener: _start_resource_monitoring 23:55:49 INFO - Starting resource monitoring. 23:55:49 INFO - ##### 23:55:49 INFO - ##### Finished create-virtualenv step (success) 23:55:49 INFO - ##### 23:55:49 INFO - ##### 23:55:49 INFO - ##### Running install step. 23:55:49 INFO - ##### 23:55:49 INFO - Running pre-action listener: _resource_record_pre_action 23:55:49 INFO - Running main action method: install 23:55:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 23:55:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 23:55:49 INFO - Reading from file tmpfile_stdout 23:55:49 INFO - Detecting whether we're running mozinstall >=1.0... 23:55:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 23:55:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 23:55:49 INFO - Reading from file tmpfile_stdout 23:55:49 INFO - Output received: 23:55:49 INFO - Usage: mozinstall [options] installer 23:55:49 INFO - Options: 23:55:49 INFO - -h, --help show this help message and exit 23:55:49 INFO - -d DEST, --destination=DEST 23:55:49 INFO - Directory to install application into. [default: 23:55:49 INFO - "/builds/slave/test"] 23:55:49 INFO - --app=APP Application being installed. [default: firefox] 23:55:49 INFO - mkdir: /builds/slave/test/build/application 23:55:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 23:55:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 23:56:05 INFO - Reading from file tmpfile_stdout 23:56:05 INFO - Output received: 23:56:05 INFO - /builds/slave/test/build/application/firefox/firefox 23:56:05 INFO - Running post-action listener: _resource_record_post_action 23:56:05 INFO - ##### 23:56:05 INFO - ##### Finished install step (success) 23:56:05 INFO - ##### 23:56:05 INFO - ##### 23:56:05 INFO - ##### Running run-tests step. 23:56:05 INFO - ##### 23:56:05 INFO - Running pre-action listener: _resource_record_pre_action 23:56:05 INFO - Running main action method: run_tests 23:56:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 23:56:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 23:56:05 INFO - Python 2.7.3 23:56:05 INFO - Return code: 0 23:56:05 INFO - grabbing minidump binary from tooltool 23:56:05 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')]} 23:56:05 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 0x16041c0>, '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 0x16050c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1605550>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 23:56:05 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 23:56:05 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 23:56:05 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 23:56:05 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 23:56:05 INFO - Return code: 0 23:56:05 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 23:56:05 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 23:56:05 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 23:56:05 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 23:56:05 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 23:56:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 23:56:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 23:56:06 INFO - Return code: 0 23:56:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-031', '--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 23:56:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-031 --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 23:56:06 INFO - Using env: {'DISPLAY': ':0', 23:56:06 INFO - 'HOME': '/home/cltbld', 23:56:06 INFO - 'LANG': 'en_US.UTF-8', 23:56:06 INFO - 'LANGUAGE': 'en_US:en', 23:56:06 INFO - 'LOGNAME': 'cltbld', 23:56:06 INFO - 'MAIL': '/var/mail/cltbld', 23:56:06 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 23:56:06 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 23:56:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 23:56:06 INFO - 'MOZ_NO_REMOTE': '1', 23:56:06 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 23:56:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 23:56:06 INFO - 'NO_EM_RESTART': '1', 23:56:06 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 23:56:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 23:56:06 INFO - 'PWD': '/builds/slave/test', 23:56:06 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 23:56:06 INFO - 'SHELL': '/bin/bash', 23:56:06 INFO - 'SHLVL': '1', 23:56:06 INFO - 'TERM': 'linux', 23:56:06 INFO - 'TMOUT': '86400', 23:56:06 INFO - 'USER': 'cltbld', 23:56:06 INFO - 'XDG_SESSION_COOKIE': 'db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261', 23:56:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 23:56:06 INFO - '_': '/tools/buildbot/bin/python'} 23:56:06 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-031', '--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 23:56:06 INFO - mozversion application_buildid: 20160706211421 23:56:06 INFO - mozversion application_changeset: bf67cbd8360a4249d6bfa0d2c256ec4291e10fc3 23:56:06 INFO - mozversion application_display_name: FirefoxDeveloperEdition 23:56:06 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 23:56:06 INFO - mozversion application_name: Firefox 23:56:06 INFO - mozversion application_remotingname: firefox-dev 23:56:06 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 23:56:06 INFO - mozversion application_vendor: Mozilla 23:56:06 INFO - mozversion application_version: 49.0a2 23:56:06 INFO - mozversion platform_buildid: 20160706211421 23:56:06 INFO - mozversion platform_changeset: bf67cbd8360a4249d6bfa0d2c256ec4291e10fc3 23:56:06 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 23:56:06 INFO - mozversion platform_version: 49.0a2 23:56:06 INFO - using testdate: 1467874566 23:56:06 INFO - actual date: 1467874566 23:56:06 INFO - starting webserver on 'localhost:49956' 23:56:06 INFO - SUITE-START | Running 2 tests 23:56:06 INFO - TEST-START | dromaeo_css 23:56:06 INFO - operating with platform_type : linux_ 23:56:06 INFO - Initialising browser for dromaeo_css test... 23:56:06 INFO - TEST-INFO | started process 3361 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHfn_mE/profile http://localhost:49956/getInfo.html) 23:56:13 INFO - PROCESS | 3361 | __metrics Screen width/height:1600/1200 23:56:13 INFO - PROCESS | 3361 | colorDepth:24 23:56:13 INFO - PROCESS | 3361 | Browser inner width/height: 1024/697 23:56:13 INFO - PROCESS | 3361 | __metrics 23:56:14 ERROR - PROCESS | 3361 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2948: TypeError: this.tabs is undefined 23:56:14 INFO - TEST-INFO | 3361: exit 0 23:56:14 INFO - Browser initialized. 23:56:14 INFO - Running cycle 1/1 for dromaeo_css test... 23:56:14 INFO - TEST-INFO | started process 3493 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHfn_mE/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:56:26 INFO - PROCESS | 3493 | RSS: Main: 155660288 23:56:26 INFO - PROCESS | 3493 | 23:57:16 INFO - PROCESS | 3493 | 1467874636201 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] 23:59:24 INFO - PROCESS | 3493 | Cycle 1(1): loaded http://localhost:49956/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49956/tests/dromaeo/cssquery-ext.html) 23:59:25 INFO - PROCESS | 3493 | RSS: Main: 160268288 23:59:25 INFO - PROCESS | 3493 | 00:02:27 INFO - PROCESS | 3493 | Cycle 1(1): loaded http://localhost:49956/tests/dromaeo/cssquery-ext.html (next: http://localhost:49956/tests/dromaeo/cssquery-jquery.html) 00:02:27 INFO - PROCESS | 3493 | RSS: Main: 157736960 00:02:28 INFO - PROCESS | 3493 | 00:05:29 INFO - PROCESS | 3493 | Cycle 1(1): loaded http://localhost:49956/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49956/tests/dromaeo/cssquery-mootools.html) 00:05:30 INFO - PROCESS | 3493 | RSS: Main: 157306880 00:05:30 INFO - PROCESS | 3493 | 00:08:32 INFO - PROCESS | 3493 | Cycle 1(1): loaded http://localhost:49956/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49956/tests/dromaeo/cssquery-prototype.html) 00:08:32 INFO - PROCESS | 3493 | RSS: Main: 158957568 00:08:32 INFO - PROCESS | 3493 | 00:11:35 INFO - PROCESS | 3493 | Cycle 1(1): loaded http://localhost:49956/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49956/tests/dromaeo/cssquery-yui.html) 00:11:35 INFO - PROCESS | 3493 | RSS: Main: 157503488 00:11:35 INFO - PROCESS | 3493 | 00:14:38 INFO - PROCESS | 3493 | Cycle 1(1): loaded http://localhost:49956/tests/dromaeo/cssquery-yui.html (next: http://localhost:49956/tests/dromaeo/cssquery-dojo.html) 00:14:38 INFO - PROCESS | 3493 | RSS: Main: 159281152 00:14:38 INFO - PROCESS | 3493 | 00:14:38 INFO - PROCESS | 3493 | __start_tp_report 00:14:38 INFO - PROCESS | 3493 | _x_x_mozilla_page_load 00:14:38 INFO - PROCESS | 3493 | _x_x_mozilla_page_load_details 00:14:38 INFO - PROCESS | 3493 | |i|pagename|runs| 00:14:38 INFO - PROCESS | 3493 | |0;dojo.html;3361.0925050236438;3411;3417.641147679493;3446.4313388290934;3449.775764575302;5674.205611214434;5676.205331253628;5720.570957178213;5740.110282906146;5750;5655.745491452884;5701.315842098944;5737.885242295151;5742.626729262605;5744.827655170341;5048.1418158913075;5097.668651537638;5126.461721519243;5154.278401023859;5157.277981082651;5013.122703526887;5047.596192304625;5175.301334319856;5178.974105129469;5197.194434862602;5118.795248190087;5130.846074617767;5147.897042059157;5158.458361872005;5187.714675692835;5100.84697459075;5115.693058416469;5200.609954253446;5204.661696989683;5222.529972302473;5079.79680812767;5115;5168.61235407346;5200.557952574036;5209.270702101709;5374.032674118657;5403.756830942617;5447.319085114361;5473.972630136864;5505.944940550623;5935.6141850779995;5989.700514974277;5991.760329586811;5996;6022.879542409171;5834.095715164156;6023;6026.306974697922;6041.24484439445;6041.275046994345;5525.419830917776;5544.944550554484;5579.302587176603;5581.888362232733;5603.635763675389;6069.696515174312;6071.392860713893;6109.541784366191;6110.327863934964;6120.44915957566;5775.88448231033;5820.097884827858;5836.124581312837;5862.912056319158;5875.059990401601;5905.232319798399;5990.311114221833;5997.340292567814;6020.69896505173;6039.577229593886;5886.3230728465915;5965.791197308074;5972.761089556369;5990.161377407167;6005.549583781147;5772;5877.324107727581;5908.615939963888;5988.221531201003;5997.190379298739;4585.312203169551;4592.885177870513;4612.364085749313;4627.097715945426;4631.096936097496;4102.138550904344;4123.814428350732;4126.504819421689;4142.896427589334;4162.41726158338;5652.74562644682;5668.574856885668;5727.5990680652785;5727.885442291131;5748.856278592985;5817.854553636108;5913.5564832636865;5966.433188847052;5970.9701451492465;6008.66952317618;5742.052561327334;5745.569082318842;5751.166080918243;5754.280714910637;5769.913451298234;5059.822906198266;5124.308218390544;5157.32954715892;5168.948310516922;5215;6354.936450635527;6356.745730170742;6367.904481432783;6378.266499352634;6412.262589802139;5878.970605146947;6079.452849243589;6093.29927058394;6094.786682466092;6116.969415152896;6177.166082578794;6242.843928901813;6249.656268905072;6322;6348.873022539431;5945.64326140433;5972.790952316648;5987.371326010706;5995.850103747442;5996.730147143302;5921.467067963904;5944.4352786485215;6039.547033972557;6040.275166979991;6056.969715151572;5787.247657804459;5872.647641141545;5898.351181370132;5905.734241959208;5939.970300148471;5837.503812176013;5868.501177399969;5890.617109887844;5891.293044834476;5904.3210030847;5609.635373700697;5722.141678748221;5729.799457018984;5740.971295143498;5834.329052159056;5890.793822216202;5904.734286957011;5925.259342582177;5938.317093534299;5960.701964901651;5809.215755872903;5833.9416605835095;5836.649801011953;5840.620359676607;5845.09401042839 00:14:38 INFO - PROCESS | 3493 | |1;ext.html;584.9736761845717;642.8425035866212;649.2792999770254;653.8888388973874;659.3999460490953;30819.84590077049;33984.66015339846;44905.999999999956;45409.31886021704;46185.53814461863;46441;46994.35519756801;47066.058678826405;47069.29396059062;47094.0581188376;8836.602352894102;9050;9094.045125261851;9101.180893719564;9111.635534578609;8807.339449541278;8954.3731938764;8956.820863582725;8960.28317734583;8960.775980600472;8954.19412252897;8958.32812539059;8986.910130898705;8992.730218093435;9010.819783604324;8936.597853096626;8961.507117108524;8964.68623598171;8984.326175536828;9012.954935225282;8840.33697472692;8902.465852048834;8959.5968181432;8990.820183596357;9016.77458063547;44349;44428;44562.554374456166;44601.553984460064;44631.55368446306;3679.5400574928135;3709.6104908984707;3756.7745935243975;3819.7708137511836;4491.124230775;34200.31599368023;34510.65489345099;34513;34797.13007174816;35503.4674479883;4587.564181402795;4656.95343046572;4697.248440249544;4697.577218050392;4700.106979673885;369879;369975;372178;372819;373318.13340933394;37916.810415947744;66135.66932165404;66322.33677663162;66904;66966.33033669698;38200.808995954845;40845;40873.795631021654;41126.79436602798;41130.38304425436;16427.5893102671;16480.670386592203;16573.50279491617;16582.419615313407;16632.50102496927;13000.869991300155;13060.412281447168;13116.08187426871;13130.146540474838;13144.474221031243;9175.495347755805;9178.403403778733;9183.494907780003;9238.538073096319;9256.028117047614;3518.1204698825295;3579.2125732338845;3581.1405262736757;3600.6939410149907;3661.5789184244154;1078.1105587890022;1117.5306371324064;1129.8079326514512;1133.739239974794;1187.9703007424885;33916.152096197795;34006.29968501565;34138.31723365519;34145.82927085349;34863.65136348655;1199.2684462477882;1206.6319772469305;1232.870548592385;1243.7139457924727;1268.7018550640591;17825.376111836023;17893.463196104138;17917.283308667767;18041.548961276072;18170;547557;864728;893992;895385;897300;60686.39313606807;60858.69570652118;61465;61639.38360616426;61971.38028619656;1494.5889880282791;1505.728968785651;1507.2991059157325;1516.2418790604697;1516.673915108257;32221;32565.837170813993;32943;33203;33554.66445335515;52940.470595293555;53624.19563706625;53729;53887.46112538981;54009.459905402015;410172;411064;412106;412914;413764;30085.849570752005;30223.69776302209;30365.544516832706;30467.238319041313;30557.236069097562;47423;47773.283400749715;49032.264516033;49326.75336623294;49579.25631115464;41063.794681026404;41232;41692;42117.1576568473;42350;40939.7953010233;40984.38523422211;41020.38469422901;41847.37228941507;41942.58057419387;40865.1826963465;41649.58350416457;41656.58343416527;41819.7909010453;42097.579024209364;35553.64446355607;36615.26769464649;36959.44560831536;37154.44268335923;37231.25537489289;27276.454470910074;28338.858305708338;28541.28646783847;28600.85699571572;28954 00:14:38 INFO - PROCESS | 3493 | |2;jquery.html;393.7361967481789;394.90719680875;398.1638559026045;398.2592378176593;427.3525608702816;13801.654958626039;18572.442826715185;19468.221271149174;20035.799642003574;20192.798072019275;18898.433047008613;18951;19199.712004319947;20021;20118.09468573914;5638.746256418461;5658.122990936411;5898.262717160355;5942.257217847769;5945.137954996545;5874.148248503986;5890.587658863881;5912.7930522431725;5915.704214789265;5947.791827286046;5722.084466485363;5857.619254748449;5923.8222853314255;5928;5945.137954996523;5648.943510564924;5841.620294680833;5854.912176317359;5903.291605007384;5905.291365036223;5130.512601302908;5147.099257629937;5165.974170129163;5172.844814655528;5173.844784656466;23806.285811425685;24089.879550602134;24365.390865228335;24894.1287054954;24908;2447.657327974085;2516.748325167487;2663.014684566703;2798.468291024699;2856.6143570618115;14318.42726290947;14875.628109297246;15088.698226035527;15237.61905952349;15516.14661193634;1845.944621661339;1947.3379051122686;1988;2012.6578481658153;2017.243533674872;54701.45298547043;72701;80701.59649201717;82981.58509207476;87754;11511.424428778528;11717.765644687059;11764.88235117655;11766.88233117658;11987.52049918011;16843.83156168447;16973.66052678964;16981;16984.49046528606;16988.150592470327;8315.00219973607;8430.789230269293;8457.154284571616;8470.788230294169;8528;7788.493747906481;7828.256315650005;7912.248336408032;7971.202879711982;8258.958705206436;5054.342935418445;5088.66923649969;5163.690178589297;5171.9482805171465;5192.324997750268;1948.9086111777167;2032.6138033773536;2082.3336532309518;2102.1906565972213;2123;987.6839411388287;1047.2302857399804;1048.6158271082252;1061.6761887624193;1089.8310761831929;17786.91106544459;18373.375049354367;19000.144993475325;19133.521661958563;19621.901890490455;998.7003898830321;1011.4184344002228;1038.7091614347994;1061.6231237910586;1116.4027245423658;10321.793564128675;10821;11107.611233606785;11122.49948752308;11150.442477876073;497941;502662;503461;504554;513193;75203.62398188084;82604.58697706593;85034.57482712547;96730.51634741922;101375.49312253391;992.2805965674828;1023.2428003277521;1030.1501261459325;1032.7108409645311;1059.6662051453768;17726.911365443608;17799.199036043152;17896.642067158846;17959.820401796336;18149.546261343574;37999.43000854934;39968.40047399233;41123.7943810291;42306.57693423027;42622.36066459068;58235;59415.40584594272;59970;60696.089558657535;60738;5455.1271796512365;5779.739911704068;8889.244414224604;8922.86615700752;9246.676366327147;10461.895381046092;13254.403551839998;13398.189029409486;13518.121322114031;13818.170909745448;11478.770424591294;11609.59366422205;11693.941530292293;11712.238704484182;12021.639350819489;11524.59663911759;11554.537818487166;11771.23486973344;11867.109966752356;12073.69815754578;10857.40284284372;11345.262557933707;11397.658070257905;11608.535658573563;11971.341576213392;9013.414128081653;9074.45553266806;9105.089491050841;9230;9307.162355388047;11351.716207094889;11689.181757277249;11824.349660768741;11827.17209795306;11852.407379631157 00:14:38 INFO - PROCESS | 3493 | |3;mootools.html;1567.9059256444611;1572.0489104092026;1760.2255007796568;1834.9633007339846;1865.0861078071741;8128.55292958887;8952.731418057461;9127.31545134116;9638.228941684674;9655.324127311082;9109.180173784358;9427;9472;9512.048795120485;9540.045995400456;2439.9146029888957;2470.1354525915967;2483.714372847128;2483.8137139714504;2495;2423.45472268739;2444.046821739523;2454.4109413740753;2469.7653722896384;2477.331120597438;2422.551827911842;2430.6111022236446;2474.7277799442045;2481.5285095831823;2482.2181012980946;2368.230325144335;2396.532676128147;2406.542756876188;2433.4646377796857;2443;2389.6057150570136;2394.8682822444757;2410.7348191698898;2440.389902524369;2447.3514518652573;9374.85937710935;9478.052194780536;9548.809023819485;9555.952220238854;9561.760955976086;5483.561315094783;5601.29983752031;5609.719514024282;5619;5623;3347.866085356607;3370.9494357584654;3427.1946092668204;3452.689257966795;3458.8270586470576;1172.8006238939315;1173.8708742038368;1174.4186627619383;1178.917475776696;1199.7300607363272;12490.562830300896;12539.623811285675;12564.937175314066;12629.936850315782;12659.74680506394;4876.390451193601;4887.169181239198;4942.9011419771405;5099.388073431212;5109.616778741609;10709.410982396043;10789.56841726322;10822.350658960488;10824.134069274596;10825.729356766144;5632.211490391266;5691.459311365414;5707.058335374617;5715.028445164332;5726.828195154152;4462.754548499864;5050.989802039533;5217.295665085241;5223.425423203445;5271.288376069258;4319.438472998553;4354.847580334673;4439.933400998988;4471.597556219956;4481.75350355727;1368.7125703602355;1380.3857283508944;1406.5288128477075;1414.9765834856255;1425.7647488164337;972.2562239886493;1045.0803293102174;1058.9258751887294;1065.8507808906759;1072.7264547540328;6341.524385671093;6451.774187903401;6459.903101453482;6469.870602587922;6493.675316234169;525.5611564343816;531.3013387395563;534.398801348483;539.2665974274983;546.803150865688;4343.543927887589;4398.164348773723;4402.713823601455;4481.887952801206;4521.570450807168;11372.31766094037;11826.586069487526;11904.047676185884;11944.581939632071;11979.640610781691;11399.316041037398;11664.88335116638;11699;11707.824382634268;11852.170348075724;8431.57842107892;8456.238938495564;8476.788080298042;8507.489550626982;8785.69250076257;6350.110984462087;6373.904391434039;6458.257300410513;6505.186851643544;6548.410643042149;10720;10789.136869050613;10880;10935.781284374427;10969.890301096886;11049.447527623748;11054.447277636247;11088.611898583511;11089.833652495057;11090.944545277222;7217.422606191597;7771.33943614799;7875.8818617719635;7983.962084928922;8046.235607617501;8931.598078086372;8989.235914947303;8989.55052247398;9009.324300677345;9087.727368178965;7369.299916507923;7559.3196612305155;7568.129665088585;7575.128860181149;7660.2722741339485;7662.540247585162;7700.460967732205;7730.072391313079;7790.376769858511;7797.220277972157;7344.522606030591;7450.552966822008;7462.179160292255;7464.402847772274;7478.06524184477;5502.862428439321;5508.366537848199;5632;5649.350324712546;5719.628224165416;5440.455954404528;5551.084071128219;5640.54875609942;5652.039153344023;5726.398728133652 00:14:38 INFO - PROCESS | 3493 | |4;prototype.html;356.1399220881571;358.7399135626671;364.3441804751447;366.8642602237173;367.7517675568992;5672.404397538261;5694.487496125348;5699.430056994299;5706.971465142674;5708.457696518834;5453.890922181564;5581.776728930848;5584.4136365681625;5593.804216852411;5615.326160860693;4413.6027757501815;4442.8452200682805;4445.466544014723;4458.910821783563;4468.798904049326;4410.64714822815;4412.24991751403;4444.755538445384;4470.441194850644;4471.8658440246845;4406.735595864258;4438.400815889862;4455.975125721086;4474;4495.887602809923;4311.504177019651;4416.536263692298;4429.822807087713;4437.312216606431;4440.178566965105;3938.8424463021443;3949.9605003949882;3961.821718022667;3963.7027222958395;3967.980160099181;5416.535476358247;5441.700706461143;5443.2107344434835;5500.4224556421395;5530.6128571000045;4611.654125940568;4881.658283920127;4917.016596680678;4944.258361245806;5160.6129540284255;5821.563382746311;5837.795677151279;5860.765569377219;5861;5881.941180588182;4153.982274342806;4175.645070169039;4181.59916427997;4201.45381100455;4203.348480985452;5951.345352011275;5995.460408563206;6085.300190478063;6117.418845209742;6156.384361563897;4268.929569158955;4288.549702281278;4298.742075475481;4307.440032795779;4309.698321117555;4276.2302785498905;4296.548862369469;4328.134373125387;4336.241157797373;4367.2575662137515;4813.78337974792;4860.756962151878;4984.202527595639;4989.501049894981;4989.600831933437;5861.941380586225;5863.970680146572;5873.353931067579;5899.262592175978;5903.911441328383;1498.423107103773;1519.8176218853807;1523.5581681312517;1527.0837497501411;1533.302347431916;935.7894473743489;982.6708052802248;987.1658448610913;989.5448093876897;996.1681995533665;5087.465816089258;5147.202183661539;5158.664686795346;5166.741662916915;5176.378834539804;5452.418798548456;5462.180672899097;5467.425920278393;5473.28847249855;5493.697846618395;4973.701577905337;5134.435212126663;5180.870478238075;5192.324997750344;5208.687478751287;2912.8639830465713;2919.226405002676;2924.722151395614;2927.209653393572;2949.348364915654;5571.66570005801;5640.53346130001;5647.407022262685;5701.344345400332;5754.510866576388;5122.719320169957;5546.169763977878;5559.444055594489;5568.693721845257;5588.435238133329;5598.44015598445;5610.719464026783;5660.377358490563;5663.065594176915;5669.376368599451;5036.496350364934;5313.601479889101;5424.620276580601;5465.141851770417;5496.560275178056;5268.236105764566;5281.471852814688;5352.411234764095;5389.568834493152;5935.643861368331;6342.809715708536;6393.456556192776;6396;6463.353664633499;6472.611643301417;4378.540253273488;4424.2036433441;4443.311286750559;4481.619062379734;4486.461624604938;6004.969975150097;6126.448619624255;6132.969335153296;6165.815025549241;6231.657258850807;5919.6744179070565;5961.970190149022;5982.88034239304;5987.5808693391045;6000.339962604197;5696.174054761954;5962.731677074629;5991.64050156992;5994.6403215807195;6003.45968862787;5871.588988770745;5876.324222714443;5886;5891.293044834647;5893.8487452078825;5968.701564921824;5970.731317090655;6041.124037014696;6047.699744554941;6090.147379366981;5625.409332020079;5900.262467191601;5905.822825315247;5948.315943666534;5948.494377977747 00:14:38 INFO - PROCESS | 3493 | |5;yui.html;748.300339182864;778.5717855179649;797.3899966525609;802.4944285100386;906.533135435251;16307.347706091758;16728.581785455368;17059.91470042648;17072.743908841378;17126.14369281537;15332;15720;15722.606934826606;15736.763948540782;15738.449154279602;570.57207094679;846.826400587878;869.387082107113;872.0538216035609;873.2010210657241;865.4980111535294;867.9783005424852;873.6592728835759;874.7813046738315;877.5436772878099;905.3888625178012;907.3648446087765;907.7549061753323;908.0601577367426;908.9454632722058;909.9818003639956;910.0626354854511;910.2217603948661;910.4446287764458;910.6812615584558;660.7125900233414;663.3101574362705;665.424407887179;665.8035879415536;666.8432918264205;14643.341049652685;14681.926590367086;14701.779473307908;14709.117452952856;14720.337584808709;14240.145591264558;14253.216073115975;14296.142231466041;14892.62768430787;15948.521544353573;13980.412278691596;14150.858491415058;14191.858081419157;14326.785098223534;14427;4693.530646935314;4705.1530724469585;4777.880552986203;4796.832110876137;4918.581920536759;66169.66915165441;68595;69088.6545567274;78672.60663696645;78746.6062669683;12107;12209.816852747215;12415;12635.115541911979;12697.301648409426;22373.440663983205;22373.776262237494;22391.77608223897;22444.775552244595;22470.775292247195;8879.85087273345;9159.679411220708;9275.953620231856;9301.627934882665;9407.482588457564;4956.652939682623;5006.148954677714;5023.447420783711;5046.747662616928;5135.666181698178;3788.507494025814;3914.8842579864604;3917.725759196886;3924.4898163238595;3939.5666476687543;659.5844617890698;673.5077036168766;677.8070595751512;687.4019602945369;688.7417218543046;655;673.7103045690302;724.1527412926888;750.2909750285927;762.3405754022731;10476.842847357295;10787.081840947436;10948.616798412017;11173.608923687632;11209.775804483865;598.3896425645904;613.4172536090732;620.9875802484015;631.848356394462;763.904511936008;4636.953630463652;4797.856064318076;4820.807167713322;5063.949360506348;5085.848527140271;68779.3122068783;104708;112755.43622282;114652;118101.40949295371;71304;102334.48832755937;102721.48639256906;103490;103922.48038759758;90715.54642226746;91850;93363.53318233366;95536;97583;9631.903680963382;9706;9710.649825810084;9846.163076138608;9854.359466634645;53200.46799531955;54023.729881350344;54123.18815217854;55257.894842103735;55422.16866746922;52212.21681674702;68539.97190042253;70032.29967700462;71904.64047679729;72245.63877180581;13937.721245574829;13952.372143253375;14155.64610884736;14162.221077840817;14363.712725745218;14064.367103480163;14297.213653248755;14538.491152809602;14981.0262332948;15425.69148616999;14847.851521484647;15050.548483545073;15120.54638360851;15271.312790924212;15357.692846143238;14833.480828170963;14944.925275373553;14960;15229.31468083961;15286.159261240738;13983.300834958414;14816.111033338035;15036.097834129987;15331.77002344988;15428.228588570302;11549.595764148215;11757.353345565734;11774.587889423829;11837.112216583619;12038.458269377725;11725.179237453296;11952.701182470508;12279.75440491203;12287.631371058882;12296.938515307365 00:14:38 INFO - PROCESS | 3493 | __end_tp_report 00:14:38 INFO - PROCESS | 3493 | __start_cc_report 00:14:38 INFO - PROCESS | 3493 | _x_x_mozilla_cycle_collect,338 00:14:38 INFO - PROCESS | 3493 | __end_cc_report 00:14:38 INFO - PROCESS | 3493 | __startTimestamp1467875678421__endTimestamp 00:14:38 INFO - PROCESS | 3493 | 00:14:38 INFO - PROCESS | 3493 | ------- Summary: start ------- 00:14:38 INFO - PROCESS | 3493 | Number of tests: 6 00:14:38 INFO - PROCESS | 3493 | 00:14:38 INFO - PROCESS | 3493 | [#0] dojo.html Cycles:165 Average:5592.06 Median:5809.22 stddev:612.39 (10.5%) stddev-sans-first:588.73 00:14:38 INFO - PROCESS | 3493 | Values: 3361.1 3411.0 3417.6 3446.4 3449.8 5674.2 5676.2 5720.6 5740.1 5750.0 5655.7 5701.3 5737.9 5742.6 5744.8 5048.1 5097.7 5126.5 5154.3 5157.3 5013.1 5047.6 5175.3 5179.0 5197.2 5118.8 5130.8 5147.9 5158.5 5187.7 5100.8 5115.7 5200.6 5204.7 5222.5 5079.8 5115.0 5168.6 5200.6 5209.3 5374.0 5403.8 5447.3 5474.0 5505.9 5935.6 5989.7 5991.8 5996.0 6022.9 5834.1 6023.0 6026.3 6041.2 6041.3 5525.4 5544.9 5579.3 5581.9 5603.6 6069.7 6071.4 6109.5 6110.3 6120.4 5775.9 5820.1 5836.1 5862.9 5875.1 5905.2 5990.3 5997.3 6020.7 6039.6 5886.3 5965.8 5972.8 5990.2 6005.5 5772.0 5877.3 5908.6 5988.2 5997.2 4585.3 4592.9 4612.4 4627.1 4631.1 4102.1 4123.8 4126.5 4142.9 4162.4 5652.7 5668.6 5727.6 5727.9 5748.9 5817.9 5913.6 5966.4 5971.0 6008.7 5742.1 5745.6 5751.2 5754.3 5769.9 5059.8 5124.3 5157.3 5168.9 5215.0 6354.9 6356.7 6367.9 6378.3 6412.3 5879.0 6079.5 6093.3 6094.8 6117.0 6177.2 6242.8 6249.7 6322.0 6348.9 5945.6 5972.8 5987.4 5995.9 5996.7 5921.5 5944.4 6039.5 6040.3 6057.0 5787.2 5872.6 5898.4 5905.7 5940.0 5837.5 5868.5 5890.6 5891.3 5904.3 5609.6 5722.1 5729.8 5741.0 5834.3 5890.8 5904.7 5925.3 5938.3 5960.7 5809.2 5833.9 5836.6 5840.6 5845.1 00:14:38 INFO - PROCESS | 3493 | 00:14:38 INFO - PROCESS | 3493 | [#1] ext.html Cycles:180 Average:67783.05 Median:227073.00 stddev:155578.96 (68.5%) stddev-sans-first:155933.59 00:14:38 INFO - PROCESS | 3493 | Values: 585.0 642.8 649.3 653.9 659.4 30819.8 33984.7 44906.0 45409.3 46185.5 46441.0 46994.4 47066.1 47069.3 47094.1 8836.6 9050.0 9094.0 9101.2 9111.6 8807.3 8954.4 8956.8 8960.3 8960.8 8954.2 8958.3 8986.9 8992.7 9010.8 8936.6 8961.5 8964.7 8984.3 9013.0 8840.3 8902.5 8959.6 8990.8 9016.8 44349.0 44428.0 44562.6 44601.6 44631.6 3679.5 3709.6 3756.8 3819.8 4491.1 34200.3 34510.7 34513.0 34797.1 35503.5 4587.6 4657.0 4697.2 4697.6 4700.1 369879.0 369975.0 372178.0 372819.0 373318.1 37916.8 66135.7 66322.3 66904.0 66966.3 38200.8 40845.0 40873.8 41126.8 41130.4 16427.6 16480.7 16573.5 16582.4 16632.5 13000.9 13060.4 13116.1 13130.1 13144.5 9175.5 9178.4 9183.5 9238.5 9256.0 3518.1 3579.2 3581.1 3600.7 3661.6 1078.1 1117.5 1129.8 1133.7 1188.0 33916.2 34006.3 34138.3 34145.8 34863.7 1199.3 1206.6 1232.9 1243.7 1268.7 17825.4 17893.5 17917.3 18041.5 18170.0 547557.0 864728.0 893992.0 895385.0 897300.0 60686.4 60858.7 61465.0 61639.4 61971.4 1494.6 1505.7 1507.3 1516.2 1516.7 32221.0 32565.8 32943.0 33203.0 33554.7 52940.5 53624.2 53729.0 53887.5 54009.5 410172.0 411064.0 412106.0 412914.0 413764.0 30085.8 30223.7 30365.5 30467.2 30557.2 47423.0 47773.3 49032.3 49326.8 49579.3 41063.8 41232.0 41692.0 42117.2 42350.0 40939.8 40984.4 41020.4 41847.4 41942.6 40865.2 41649.6 41656.6 41819.8 42097.6 35553.6 36615.3 36959.4 37154.4 37231.3 27276.5 28338.9 28541.3 28600.9 28954.0 00:14:38 INFO - PROCESS | 3493 | 00:14:38 INFO - PROCESS | 3493 | [#2] jquery.html Cycles:180 Average:29420.02 Median:13406.52 stddev:82928.08 (618.6%) stddev-sans-first:83132.07 00:14:38 INFO - PROCESS | 3493 | Values: 393.7 394.9 398.2 398.3 427.4 13801.7 18572.4 19468.2 20035.8 20192.8 18898.4 18951.0 19199.7 20021.0 20118.1 5638.7 5658.1 5898.3 5942.3 5945.1 5874.1 5890.6 5912.8 5915.7 5947.8 5722.1 5857.6 5923.8 5928.0 5945.1 5648.9 5841.6 5854.9 5903.3 5905.3 5130.5 5147.1 5166.0 5172.8 5173.8 23806.3 24089.9 24365.4 24894.1 24908.0 2447.7 2516.7 2663.0 2798.5 2856.6 14318.4 14875.6 15088.7 15237.6 15516.1 1845.9 1947.3 1988.0 2012.7 2017.2 54701.5 72701.0 80701.6 82981.6 87754.0 11511.4 11717.8 11764.9 11766.9 11987.5 16843.8 16973.7 16981.0 16984.5 16988.2 8315.0 8430.8 8457.2 8470.8 8528.0 7788.5 7828.3 7912.2 7971.2 8259.0 5054.3 5088.7 5163.7 5171.9 5192.3 1948.9 2032.6 2082.3 2102.2 2123.0 987.7 1047.2 1048.6 1061.7 1089.8 17786.9 18373.4 19000.1 19133.5 19621.9 998.7 1011.4 1038.7 1061.6 1116.4 10321.8 10821.0 11107.6 11122.5 11150.4 497941.0 502662.0 503461.0 504554.0 513193.0 75203.6 82604.6 85034.6 96730.5 101375.5 992.3 1023.2 1030.2 1032.7 1059.7 17726.9 17799.2 17896.6 17959.8 18149.5 37999.4 39968.4 41123.8 42306.6 42622.4 58235.0 59415.4 59970.0 60696.1 60738.0 5455.1 5779.7 8889.2 8922.9 9246.7 10461.9 13254.4 13398.2 13518.1 13818.2 11478.8 11609.6 11693.9 11712.2 12021.6 11524.6 11554.5 11771.2 11867.1 12073.7 10857.4 11345.3 11397.7 11608.5 11971.3 9013.4 9074.5 9105.1 9230.0 9307.2 11351.7 11689.2 11824.3 11827.2 11852.4 00:14:38 INFO - PROCESS | 3493 | 00:14:38 INFO - PROCESS | 3493 | [#3] mootools.html Cycles:180 Average:6127.11 Median:4881.78 stddev:3490.42 (71.5%) stddev-sans-first:3483.40 00:14:38 INFO - PROCESS | 3493 | Values: 1567.9 1572.0 1760.2 1835.0 1865.1 8128.6 8952.7 9127.3 9638.2 9655.3 9109.2 9427.0 9472.0 9512.0 9540.0 2439.9 2470.1 2483.7 2483.8 2495.0 2423.5 2444.0 2454.4 2469.8 2477.3 2422.6 2430.6 2474.7 2481.5 2482.2 2368.2 2396.5 2406.5 2433.5 2443.0 2389.6 2394.9 2410.7 2440.4 2447.4 9374.9 9478.1 9548.8 9556.0 9561.8 5483.6 5601.3 5609.7 5619.0 5623.0 3347.9 3370.9 3427.2 3452.7 3458.8 1172.8 1173.9 1174.4 1178.9 1199.7 12490.6 12539.6 12564.9 12629.9 12659.7 4876.4 4887.2 4942.9 5099.4 5109.6 10709.4 10789.6 10822.4 10824.1 10825.7 5632.2 5691.5 5707.1 5715.0 5726.8 4462.8 5051.0 5217.3 5223.4 5271.3 4319.4 4354.8 4439.9 4471.6 4481.8 1368.7 1380.4 1406.5 1415.0 1425.8 972.3 1045.1 1058.9 1065.9 1072.7 6341.5 6451.8 6459.9 6469.9 6493.7 525.6 531.3 534.4 539.3 546.8 4343.5 4398.2 4402.7 4481.9 4521.6 11372.3 11826.6 11904.0 11944.6 11979.6 11399.3 11664.9 11699.0 11707.8 11852.2 8431.6 8456.2 8476.8 8507.5 8785.7 6350.1 6373.9 6458.3 6505.2 6548.4 10720.0 10789.1 10880.0 10935.8 10969.9 11049.4 11054.4 11088.6 11089.8 11090.9 7217.4 7771.3 7875.9 7984.0 8046.2 8931.6 8989.2 8989.6 9009.3 9087.7 7369.3 7559.3 7568.1 7575.1 7660.3 7662.5 7700.5 7730.1 7790.4 7797.2 7344.5 7450.6 7462.2 7464.4 7478.1 5502.9 5508.4 5632.0 5649.4 5719.6 5440.5 5551.1 5640.5 5652.0 5726.4 00:14:38 INFO - PROCESS | 3493 | 00:14:38 INFO - PROCESS | 3493 | [#4] prototype.html Cycles:180 Average:4851.02 Median:5447.81 stddev:1406.27 (25.8%) stddev-sans-first:1369.15 00:14:38 INFO - PROCESS | 3493 | Values: 356.1 358.7 364.3 366.9 367.8 5672.4 5694.5 5699.4 5707.0 5708.5 5453.9 5581.8 5584.4 5593.8 5615.3 4413.6 4442.8 4445.5 4458.9 4468.8 4410.6 4412.2 4444.8 4470.4 4471.9 4406.7 4438.4 4456.0 4474.0 4495.9 4311.5 4416.5 4429.8 4437.3 4440.2 3938.8 3950.0 3961.8 3963.7 3968.0 5416.5 5441.7 5443.2 5500.4 5530.6 4611.7 4881.7 4917.0 4944.3 5160.6 5821.6 5837.8 5860.8 5861.0 5881.9 4154.0 4175.6 4181.6 4201.5 4203.3 5951.3 5995.5 6085.3 6117.4 6156.4 4268.9 4288.5 4298.7 4307.4 4309.7 4276.2 4296.5 4328.1 4336.2 4367.3 4813.8 4860.8 4984.2 4989.5 4989.6 5861.9 5864.0 5873.4 5899.3 5903.9 1498.4 1519.8 1523.6 1527.1 1533.3 935.8 982.7 987.2 989.5 996.2 5087.5 5147.2 5158.7 5166.7 5176.4 5452.4 5462.2 5467.4 5473.3 5493.7 4973.7 5134.4 5180.9 5192.3 5208.7 2912.9 2919.2 2924.7 2927.2 2949.3 5571.7 5640.5 5647.4 5701.3 5754.5 5122.7 5546.2 5559.4 5568.7 5588.4 5598.4 5610.7 5660.4 5663.1 5669.4 5036.5 5313.6 5424.6 5465.1 5496.6 5268.2 5281.5 5352.4 5389.6 5935.6 6342.8 6393.5 6396.0 6463.4 6472.6 4378.5 4424.2 4443.3 4481.6 4486.5 6005.0 6126.4 6133.0 6165.8 6231.7 5919.7 5962.0 5982.9 5987.6 6000.3 5696.2 5962.7 5991.6 5994.6 6003.5 5871.6 5876.3 5886.0 5891.3 5893.8 5968.7 5970.7 6041.1 6047.7 6090.1 5625.4 5900.3 5905.8 5948.3 5948.5 00:14:38 INFO - PROCESS | 3493 | 00:14:38 INFO - PROCESS | 3493 | [#5] yui.html Cycles:180 Average:20894.95 Median:4741.52 stddev:28975.90 (611.1%) stddev-sans-first:29017.69 00:14:38 INFO - PROCESS | 3493 | Values: 748.3 778.6 797.4 802.5 906.5 16307.3 16728.6 17059.9 17072.7 17126.1 15332.0 15720.0 15722.6 15736.8 15738.4 570.6 846.8 869.4 872.1 873.2 865.5 868.0 873.7 874.8 877.5 905.4 907.4 907.8 908.1 908.9 910.0 910.1 910.2 910.4 910.7 660.7 663.3 665.4 665.8 666.8 14643.3 14681.9 14701.8 14709.1 14720.3 14240.1 14253.2 14296.1 14892.6 15948.5 13980.4 14150.9 14191.9 14326.8 14427.0 4693.5 4705.2 4777.9 4796.8 4918.6 66169.7 68595.0 69088.7 78672.6 78746.6 12107.0 12209.8 12415.0 12635.1 12697.3 22373.4 22373.8 22391.8 22444.8 22470.8 8879.9 9159.7 9276.0 9301.6 9407.5 4956.7 5006.1 5023.4 5046.7 5135.7 3788.5 3914.9 3917.7 3924.5 3939.6 659.6 673.5 677.8 687.4 688.7 655.0 673.7 724.2 750.3 762.3 10476.8 10787.1 10948.6 11173.6 11209.8 598.4 613.4 621.0 631.8 763.9 4637.0 4797.9 4820.8 5063.9 5085.8 68779.3 104708.0 112755.4 114652.0 118101.4 71304.0 102334.5 102721.5 103490.0 103922.5 90715.5 91850.0 93363.5 95536.0 97583.0 9631.9 9706.0 9710.6 9846.2 9854.4 53200.5 54023.7 54123.2 55257.9 55422.2 52212.2 68540.0 70032.3 71904.6 72245.6 13937.7 13952.4 14155.6 14162.2 14363.7 14064.4 14297.2 14538.5 14981.0 15425.7 14847.9 15050.5 15120.5 15271.3 15357.7 14833.5 14944.9 14960.0 15229.3 15286.2 13983.3 14816.1 15036.1 15331.8 15428.2 11549.6 11757.4 11774.6 11837.1 12038.5 11725.2 11952.7 12279.8 12287.6 12296.9 00:14:38 INFO - PROCESS | 3493 | -------- Summary: end -------- 00:14:38 INFO - PROCESS | 3493 | 00:14:38 INFO - TEST-INFO | 3493: exit 0 00:14:39 INFO - TEST-OK | dromaeo_css | took 1112179ms 00:14:39 INFO - TEST-START | kraken 00:14:39 INFO - operating with platform_type : linux_ 00:14:39 INFO - Initialising browser for kraken test... 00:14:39 INFO - TEST-INFO | started process 3734 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpIFuiqB/profile http://localhost:49956/getInfo.html) 00:14:43 INFO - PROCESS | 3734 | __metrics Screen width/height:1600/1200 00:14:43 INFO - PROCESS | 3734 | colorDepth:24 00:14:43 INFO - PROCESS | 3734 | Browser inner width/height: 1024/697 00:14:43 INFO - PROCESS | 3734 | __metrics 00:14:43 ERROR - PROCESS | 3734 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2948: TypeError: this.tabs is undefined 00:14:44 INFO - TEST-INFO | 3734: exit 0 00:14:44 INFO - Browser initialized. 00:14:44 INFO - Running cycle 1/1 for kraken test... 00:14:44 INFO - TEST-INFO | started process 3866 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpIFuiqB/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 00:14:56 INFO - PROCESS | 3866 | RSS: Main: 156184576 00:14:56 INFO - PROCESS | 3866 | 00:14:58 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49956/tests/kraken/driver.html?testName=audio-beat-detection) 00:14:59 INFO - PROCESS | 3866 | RSS: Main: 161255424 00:14:59 INFO - PROCESS | 3866 | 00:15:02 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49956/tests/kraken/driver.html?testName=audio-dft) 00:15:02 INFO - PROCESS | 3866 | RSS: Main: 160530432 00:15:02 INFO - PROCESS | 3866 | 00:15:05 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49956/tests/kraken/driver.html?testName=audio-fft) 00:15:06 INFO - PROCESS | 3866 | RSS: Main: 160948224 00:15:06 INFO - PROCESS | 3866 | 00:15:08 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49956/tests/kraken/driver.html?testName=audio-oscillator) 00:15:08 INFO - PROCESS | 3866 | RSS: Main: 160784384 00:15:08 INFO - PROCESS | 3866 | 00:15:11 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49956/tests/kraken/driver.html?testName=imaging-gaussian-blur) 00:15:11 INFO - PROCESS | 3866 | RSS: Main: 160583680 00:15:11 INFO - PROCESS | 3866 | 00:15:14 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49956/tests/kraken/driver.html?testName=imaging-darkroom) 00:15:15 INFO - PROCESS | 3866 | RSS: Main: 160800768 00:15:15 INFO - PROCESS | 3866 | 00:15:18 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49956/tests/kraken/driver.html?testName=imaging-desaturate) 00:15:19 INFO - PROCESS | 3866 | RSS: Main: 161034240 00:15:19 INFO - PROCESS | 3866 | 00:15:22 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49956/tests/kraken/driver.html?testName=json-parse-financial) 00:15:22 INFO - PROCESS | 3866 | RSS: Main: 161095680 00:15:22 INFO - PROCESS | 3866 | 00:15:24 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49956/tests/kraken/driver.html?testName=json-stringify-tinderbox) 00:15:24 INFO - PROCESS | 3866 | RSS: Main: 160768000 00:15:24 INFO - PROCESS | 3866 | 00:15:26 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49956/tests/kraken/driver.html?testName=stanford-crypto-aes) 00:15:27 INFO - PROCESS | 3866 | RSS: Main: 161021952 00:15:27 INFO - PROCESS | 3866 | 00:15:29 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49956/tests/kraken/driver.html?testName=stanford-crypto-ccm) 00:15:30 INFO - PROCESS | 3866 | RSS: Main: 161427456 00:15:30 INFO - PROCESS | 3866 | 00:15:32 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49956/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 00:15:33 INFO - PROCESS | 3866 | RSS: Main: 161935360 00:15:33 INFO - PROCESS | 3866 | 00:15:35 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49956/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 00:15:36 INFO - PROCESS | 3866 | RSS: Main: 161488896 00:15:36 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | Cycle 1(1): loaded http://localhost:49956/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49956/tests/kraken/driver.html?testName=ai-astar) 00:15:38 INFO - PROCESS | 3866 | RSS: Main: 162066432 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | __start_tp_report 00:15:38 INFO - PROCESS | 3866 | _x_x_mozilla_page_load 00:15:38 INFO - PROCESS | 3866 | _x_x_mozilla_page_load_details 00:15:38 INFO - PROCESS | 3866 | |i|pagename|runs| 00:15:38 INFO - PROCESS | 3866 | |0;ai-astar;112;104;114;110;113;112;118;109;109;111 00:15:38 INFO - PROCESS | 3866 | |1;audio-beat-detection;149;130;152;175;133;152;153;130;174;131 00:15:38 INFO - PROCESS | 3866 | |2;audio-dft;161;162;162;163;162;162;162;162;163;159 00:15:38 INFO - PROCESS | 3866 | |3;audio-fft;77;74;75;164;75;76;76;77;182;77 00:15:38 INFO - PROCESS | 3866 | |4;audio-oscillator;84;85;147;86;85;88;150;85;85;143 00:15:38 INFO - PROCESS | 3866 | |5;imaging-gaussian-blur;118;117;117;117;117;117;117;118;118;118 00:15:38 INFO - PROCESS | 3866 | |6;imaging-darkroom;147;147;147;146;147;148;146;147;146;147 00:15:38 INFO - PROCESS | 3866 | |7;imaging-desaturate;96;95;96;96;95;96;96;96;96;96 00:15:38 INFO - PROCESS | 3866 | |8;json-parse-financial;53;51;52;53;54;55;52;53;60;52 00:15:38 INFO - PROCESS | 3866 | |9;json-stringify-tinderbox;64;59;59;59;59;60;60;60;60;60 00:15:38 INFO - PROCESS | 3866 | |10;stanford-crypto-aes;76;84;76;79;80;79;78;78;107;78 00:15:38 INFO - PROCESS | 3866 | |11;stanford-crypto-ccm;129;122;119;128;124;119;124;128;124;134 00:15:38 INFO - PROCESS | 3866 | |12;stanford-crypto-pbkdf2;157;156;157;156;158;154;156;155;156;155 00:15:38 INFO - PROCESS | 3866 | |13;stanford-crypto-sha256-iterative;63;63;64;61;61;66;61;62;63;61 00:15:38 INFO - PROCESS | 3866 | __end_tp_report 00:15:38 INFO - PROCESS | 3866 | __start_cc_report 00:15:38 INFO - PROCESS | 3866 | _x_x_mozilla_cycle_collect,851 00:15:38 INFO - PROCESS | 3866 | __end_cc_report 00:15:38 INFO - PROCESS | 3866 | __startTimestamp1467875738303__endTimestamp 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | ------- Summary: start ------- 00:15:38 INFO - PROCESS | 3866 | Number of tests: 14 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#0] ai-astar Cycles:10 Average:111.20 Median:112.00 stddev:3.68 (3.3%) stddev-sans-first:3.89 00:15:38 INFO - PROCESS | 3866 | Values: 112.0 104.0 114.0 110.0 113.0 112.0 118.0 109.0 109.0 111.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#1] audio-beat-detection Cycles:10 Average:147.90 Median:152.00 stddev:17.08 (11.2%) stddev-sans-first:18.11 00:15:38 INFO - PROCESS | 3866 | Values: 149.0 130.0 152.0 175.0 133.0 152.0 153.0 130.0 174.0 131.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#2] audio-dft Cycles:10 Average:161.80 Median:162.00 stddev:1.14 (0.7%) stddev-sans-first:1.17 00:15:38 INFO - PROCESS | 3866 | Values: 161.0 162.0 162.0 163.0 162.0 162.0 162.0 162.0 163.0 159.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#3] audio-fft Cycles:10 Average:95.30 Median:76.00 stddev:41.18 (54.2%) stddev-sans-first:43.15 00:15:38 INFO - PROCESS | 3866 | Values: 77.0 74.0 75.0 164.0 75.0 76.0 76.0 77.0 182.0 77.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#4] audio-oscillator Cycles:10 Average:103.80 Median:85.00 stddev:29.65 (34.9%) stddev-sans-first:30.57 00:15:38 INFO - PROCESS | 3866 | Values: 84.0 85.0 147.0 86.0 85.0 88.0 150.0 85.0 85.0 143.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#5] imaging-gaussian-blur Cycles:10 Average:117.40 Median:117.50 stddev:0.52 (0.4%) stddev-sans-first:0.50 00:15:38 INFO - PROCESS | 3866 | Values: 118.0 117.0 117.0 117.0 117.0 117.0 117.0 118.0 118.0 118.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#6] imaging-darkroom Cycles:10 Average:146.80 Median:147.00 stddev:0.63 (0.4%) stddev-sans-first:0.67 00:15:38 INFO - PROCESS | 3866 | Values: 147.0 147.0 147.0 146.0 147.0 148.0 146.0 147.0 146.0 147.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:96.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 00:15:38 INFO - PROCESS | 3866 | Values: 96.0 95.0 96.0 96.0 95.0 96.0 96.0 96.0 96.0 96.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#8] json-parse-financial Cycles:10 Average:53.50 Median:53.00 stddev:2.55 (4.8%) stddev-sans-first:2.70 00:15:38 INFO - PROCESS | 3866 | Values: 53.0 51.0 52.0 53.0 54.0 55.0 52.0 53.0 60.0 52.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#9] json-stringify-tinderbox Cycles:10 Average:60.00 Median:60.00 stddev:1.49 (2.5%) stddev-sans-first:0.53 00:15:38 INFO - PROCESS | 3866 | Values: 64.0 59.0 59.0 59.0 59.0 60.0 60.0 60.0 60.0 60.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#10] stanford-crypto-aes Cycles:10 Average:81.50 Median:78.50 stddev:9.24 (11.8%) stddev-sans-first:9.58 00:15:38 INFO - PROCESS | 3866 | Values: 76.0 84.0 76.0 79.0 80.0 79.0 78.0 78.0 107.0 78.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#11] stanford-crypto-ccm Cycles:10 Average:125.10 Median:126.00 stddev:4.70 (3.7%) stddev-sans-first:4.77 00:15:38 INFO - PROCESS | 3866 | Values: 129.0 122.0 119.0 128.0 124.0 119.0 124.0 128.0 124.0 134.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:156.00 Median:156.00 stddev:1.15 (0.7%) stddev-sans-first:1.17 00:15:38 INFO - PROCESS | 3866 | Values: 157.0 156.0 157.0 156.0 158.0 154.0 156.0 155.0 156.0 155.0 00:15:38 INFO - PROCESS | 3866 | 00:15:38 INFO - PROCESS | 3866 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:62.50 Median:63.00 stddev:1.65 (2.6%) stddev-sans-first:1.74 00:15:38 INFO - PROCESS | 3866 | Values: 63.0 63.0 64.0 61.0 61.0 66.0 61.0 62.0 63.0 61.0 00:15:38 INFO - PROCESS | 3866 | -------- Summary: end -------- 00:15:38 INFO - PROCESS | 3866 | 00:15:39 INFO - TEST-INFO | 3866: exit 0 00:15:39 INFO - TEST-OK | kraken | took 60185ms 00:15:39 INFO - SUITE-END | took 1172s 00:15:39 INFO - Completed test suite (00:19:32) 00:15:39 INFO - javascript benchmark 00:15:39 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7499.201930671244, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3361.0925050236438, 3411.0, 3417.641147679493, 3446.4313388290934, 3449.775764575302, 5674.205611214434, 5676.205331253628, 5720.570957178213, 5740.110282906146, 5750.0, 5655.745491452884, 5701.315842098944, 5737.885242295151, 5742.626729262605, 5744.827655170341, 5048.1418158913075, 5097.668651537638, 5126.461721519243, 5154.278401023859, 5157.277981082651, 5013.122703526887, 5047.596192304625, 5175.301334319856, 5178.974105129469, 5197.194434862602, 5118.795248190087, 5130.846074617767, 5147.897042059157, 5158.458361872005, 5187.714675692835, 5100.84697459075, 5115.693058416469, 5200.609954253446, 5204.661696989683, 5222.529972302473, 5079.79680812767, 5115.0, 5168.61235407346, 5200.557952574036, 5209.270702101709, 5374.032674118657, 5403.756830942617, 5447.319085114361, 5473.972630136864, 5505.944940550623, 5935.6141850779995, 5989.700514974277, 5991.760329586811, 5996.0, 6022.879542409171, 5834.095715164156, 6023.0, 6026.306974697922, 6041.24484439445, 6041.275046994345, 5525.419830917776, 5544.944550554484, 5579.302587176603, 5581.888362232733, 5603.635763675389, 6069.696515174312, 6071.392860713893, 6109.541784366191, 6110.327863934964, 6120.44915957566, 5775.88448231033, 5820.097884827858, 5836.124581312837, 5862.912056319158, 5875.059990401601, 5905.232319798399, 5990.311114221833, 5997.340292567814, 6020.69896505173, 6039.577229593886, 5886.3230728465915, 5965.791197308074, 5972.761089556369, 5990.161377407167, 6005.549583781147, 5772.0, 5877.324107727581, 5908.615939963888, 5988.221531201003, 5997.190379298739, 4585.312203169551, 4592.885177870513, 4612.364085749313, 4627.097715945426, 4631.096936097496, 4102.138550904344, 4123.814428350732, 4126.504819421689, 4142.896427589334, 4162.41726158338, 5652.74562644682, 5668.574856885668, 5727.5990680652785, 5727.885442291131, 5748.856278592985, 5817.854553636108, 5913.5564832636865, 5966.433188847052, 5970.9701451492465, 6008.66952317618, 5742.052561327334, 5745.569082318842, 5751.166080918243, 5754.280714910637, 5769.913451298234, 5059.822906198266, 5124.308218390544, 5157.32954715892, 5168.948310516922, 5215.0, 6354.936450635527, 6356.745730170742, 6367.904481432783, 6378.266499352634, 6412.262589802139, 5878.970605146947, 6079.452849243589, 6093.29927058394, 6094.786682466092, 6116.969415152896, 6177.166082578794, 6242.843928901813, 6249.656268905072, 6322.0, 6348.873022539431, 5945.64326140433, 5972.790952316648, 5987.371326010706, 5995.850103747442, 5996.730147143302, 5921.467067963904, 5944.4352786485215, 6039.547033972557, 6040.275166979991, 6056.969715151572, 5787.247657804459, 5872.647641141545, 5898.351181370132, 5905.734241959208, 5939.970300148471, 5837.503812176013, 5868.501177399969, 5890.617109887844, 5891.293044834476, 5904.3210030847, 5609.635373700697, 5722.141678748221, 5729.799457018984, 5740.971295143498, 5834.329052159056, 5890.793822216202, 5904.734286957011, 5925.259342582177, 5938.317093534299, 5960.701964901651, 5809.215755872903, 5833.9416605835095, 5836.649801011953, 5840.620359676607, 5845.09401042839], "value": 5553.002675177296, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [584.9736761845717, 642.8425035866212, 649.2792999770254, 653.8888388973874, 659.3999460490953, 30819.84590077049, 33984.66015339846, 44905.999999999956, 45409.31886021704, 46185.53814461863, 46441.0, 46994.35519756801, 47066.058678826405, 47069.29396059062, 47094.0581188376, 8836.602352894102, 9050.0, 9094.045125261851, 9101.180893719564, 9111.635534578609, 8807.339449541278, 8954.3731938764, 8956.820863582725, 8960.28317734583, 8960.775980600472, 8954.19412252897, 8958.32812539059, 8986.910130898705, 8992.730218093435, 9010.819783604324, 8936.597853096626, 8961.507117108524, 8964.68623598171, 8984.326175536828, 9012.954935225282, 8840.33697472692, 8902.465852048834, 8959.5968181432, 8990.820183596357, 9016.77458063547, 44349.0, 44428.0, 44562.554374456166, 44601.553984460064, 44631.55368446306, 3679.5400574928135, 3709.6104908984707, 3756.7745935243975, 3819.7708137511836, 4491.124230775, 34200.31599368023, 34510.65489345099, 34513.0, 34797.13007174816, 35503.4674479883, 4587.564181402795, 4656.95343046572, 4697.248440249544, 4697.577218050392, 4700.106979673885, 369879.0, 369975.0, 372178.0, 372819.0, 373318.13340933394, 37916.810415947744, 66135.66932165404, 66322.33677663162, 66904.0, 66966.33033669698, 38200.808995954845, 40845.0, 40873.795631021654, 41126.79436602798, 41130.38304425436, 16427.5893102671, 16480.670386592203, 16573.50279491617, 16582.419615313407, 16632.50102496927, 13000.869991300155, 13060.412281447168, 13116.08187426871, 13130.146540474838, 13144.474221031243, 9175.495347755805, 9178.403403778733, 9183.494907780003, 9238.538073096319, 9256.028117047614, 3518.1204698825295, 3579.2125732338845, 3581.1405262736757, 3600.6939410149907, 3661.5789184244154, 1078.1105587890022, 1117.5306371324064, 1129.8079326514512, 1133.739239974794, 1187.9703007424885, 33916.152096197795, 34006.29968501565, 34138.31723365519, 34145.82927085349, 34863.65136348655, 1199.2684462477882, 1206.6319772469305, 1232.870548592385, 1243.7139457924727, 1268.7018550640591, 17825.376111836023, 17893.463196104138, 17917.283308667767, 18041.548961276072, 18170.0, 547557.0, 864728.0, 893992.0, 895385.0, 897300.0, 60686.39313606807, 60858.69570652118, 61465.0, 61639.38360616426, 61971.38028619656, 1494.5889880282791, 1505.728968785651, 1507.2991059157325, 1516.2418790604697, 1516.673915108257, 32221.0, 32565.837170813993, 32943.0, 33203.0, 33554.66445335515, 52940.470595293555, 53624.19563706625, 53729.0, 53887.46112538981, 54009.459905402015, 410172.0, 411064.0, 412106.0, 412914.0, 413764.0, 30085.849570752005, 30223.69776302209, 30365.544516832706, 30467.238319041313, 30557.236069097562, 47423.0, 47773.283400749715, 49032.264516033, 49326.75336623294, 49579.25631115464, 41063.794681026404, 41232.0, 41692.0, 42117.1576568473, 42350.0, 40939.7953010233, 40984.38523422211, 41020.38469422901, 41847.37228941507, 41942.58057419387, 40865.1826963465, 41649.58350416457, 41656.58343416527, 41819.7909010453, 42097.579024209364, 35553.64446355607, 36615.26769464649, 36959.44560831536, 37154.44268335923, 37231.25537489289, 27276.454470910074, 28338.858305708338, 28541.28646783847, 28600.85699571572, 28954.0], "value": 19985.690854069162, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [393.7361967481789, 394.90719680875, 398.1638559026045, 398.2592378176593, 427.3525608702816, 13801.654958626039, 18572.442826715185, 19468.221271149174, 20035.799642003574, 20192.798072019275, 18898.433047008613, 18951.0, 19199.712004319947, 20021.0, 20118.09468573914, 5638.746256418461, 5658.122990936411, 5898.262717160355, 5942.257217847769, 5945.137954996545, 5874.148248503986, 5890.587658863881, 5912.7930522431725, 5915.704214789265, 5947.791827286046, 5722.084466485363, 5857.619254748449, 5923.8222853314255, 5928.0, 5945.137954996523, 5648.943510564924, 5841.620294680833, 5854.912176317359, 5903.291605007384, 5905.291365036223, 5130.512601302908, 5147.099257629937, 5165.974170129163, 5172.844814655528, 5173.844784656466, 23806.285811425685, 24089.879550602134, 24365.390865228335, 24894.1287054954, 24908.0, 2447.657327974085, 2516.748325167487, 2663.014684566703, 2798.468291024699, 2856.6143570618115, 14318.42726290947, 14875.628109297246, 15088.698226035527, 15237.61905952349, 15516.14661193634, 1845.944621661339, 1947.3379051122686, 1988.0, 2012.6578481658153, 2017.243533674872, 54701.45298547043, 72701.0, 80701.59649201717, 82981.58509207476, 87754.0, 11511.424428778528, 11717.765644687059, 11764.88235117655, 11766.88233117658, 11987.52049918011, 16843.83156168447, 16973.66052678964, 16981.0, 16984.49046528606, 16988.150592470327, 8315.00219973607, 8430.789230269293, 8457.154284571616, 8470.788230294169, 8528.0, 7788.493747906481, 7828.256315650005, 7912.248336408032, 7971.202879711982, 8258.958705206436, 5054.342935418445, 5088.66923649969, 5163.690178589297, 5171.9482805171465, 5192.324997750268, 1948.9086111777167, 2032.6138033773536, 2082.3336532309518, 2102.1906565972213, 2123.0, 987.6839411388287, 1047.2302857399804, 1048.6158271082252, 1061.6761887624193, 1089.8310761831929, 17786.91106544459, 18373.375049354367, 19000.144993475325, 19133.521661958563, 19621.901890490455, 998.7003898830321, 1011.4184344002228, 1038.7091614347994, 1061.6231237910586, 1116.4027245423658, 10321.793564128675, 10821.0, 11107.611233606785, 11122.49948752308, 11150.442477876073, 497941.0, 502662.0, 503461.0, 504554.0, 513193.0, 75203.62398188084, 82604.58697706593, 85034.57482712547, 96730.51634741922, 101375.49312253391, 992.2805965674828, 1023.2428003277521, 1030.1501261459325, 1032.7108409645311, 1059.6662051453768, 17726.911365443608, 17799.199036043152, 17896.642067158846, 17959.820401796336, 18149.546261343574, 37999.43000854934, 39968.40047399233, 41123.7943810291, 42306.57693423027, 42622.36066459068, 58235.0, 59415.40584594272, 59970.0, 60696.089558657535, 60738.0, 5455.1271796512365, 5779.739911704068, 8889.244414224604, 8922.86615700752, 9246.676366327147, 10461.895381046092, 13254.403551839998, 13398.189029409486, 13518.121322114031, 13818.170909745448, 11478.770424591294, 11609.59366422205, 11693.941530292293, 11712.238704484182, 12021.639350819489, 11524.59663911759, 11554.537818487166, 11771.23486973344, 11867.109966752356, 12073.69815754578, 10857.40284284372, 11345.262557933707, 11397.658070257905, 11608.535658573563, 11971.341576213392, 9013.414128081653, 9074.45553266806, 9105.089491050841, 9230.0, 9307.162355388047, 11351.716207094889, 11689.181757277249, 11824.349660768741, 11827.17209795306, 11852.407379631157], "value": 9456.902815563575, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1567.9059256444611, 1572.0489104092026, 1760.2255007796568, 1834.9633007339846, 1865.0861078071741, 8128.55292958887, 8952.731418057461, 9127.31545134116, 9638.228941684674, 9655.324127311082, 9109.180173784358, 9427.0, 9472.0, 9512.048795120485, 9540.045995400456, 2439.9146029888957, 2470.1354525915967, 2483.714372847128, 2483.8137139714504, 2495.0, 2423.45472268739, 2444.046821739523, 2454.4109413740753, 2469.7653722896384, 2477.331120597438, 2422.551827911842, 2430.6111022236446, 2474.7277799442045, 2481.5285095831823, 2482.2181012980946, 2368.230325144335, 2396.532676128147, 2406.542756876188, 2433.4646377796857, 2443.0, 2389.6057150570136, 2394.8682822444757, 2410.7348191698898, 2440.389902524369, 2447.3514518652573, 9374.85937710935, 9478.052194780536, 9548.809023819485, 9555.952220238854, 9561.760955976086, 5483.561315094783, 5601.29983752031, 5609.719514024282, 5619.0, 5623.0, 3347.866085356607, 3370.9494357584654, 3427.1946092668204, 3452.689257966795, 3458.8270586470576, 1172.8006238939315, 1173.8708742038368, 1174.4186627619383, 1178.917475776696, 1199.7300607363272, 12490.562830300896, 12539.623811285675, 12564.937175314066, 12629.936850315782, 12659.74680506394, 4876.390451193601, 4887.169181239198, 4942.9011419771405, 5099.388073431212, 5109.616778741609, 10709.410982396043, 10789.56841726322, 10822.350658960488, 10824.134069274596, 10825.729356766144, 5632.211490391266, 5691.459311365414, 5707.058335374617, 5715.028445164332, 5726.828195154152, 4462.754548499864, 5050.989802039533, 5217.295665085241, 5223.425423203445, 5271.288376069258, 4319.438472998553, 4354.847580334673, 4439.933400998988, 4471.597556219956, 4481.75350355727, 1368.7125703602355, 1380.3857283508944, 1406.5288128477075, 1414.9765834856255, 1425.7647488164337, 972.2562239886493, 1045.0803293102174, 1058.9258751887294, 1065.8507808906759, 1072.7264547540328, 6341.524385671093, 6451.774187903401, 6459.903101453482, 6469.870602587922, 6493.675316234169, 525.5611564343816, 531.3013387395563, 534.398801348483, 539.2665974274983, 546.803150865688, 4343.543927887589, 4398.164348773723, 4402.713823601455, 4481.887952801206, 4521.570450807168, 11372.31766094037, 11826.586069487526, 11904.047676185884, 11944.581939632071, 11979.640610781691, 11399.316041037398, 11664.88335116638, 11699.0, 11707.824382634268, 11852.170348075724, 8431.57842107892, 8456.238938495564, 8476.788080298042, 8507.489550626982, 8785.69250076257, 6350.110984462087, 6373.904391434039, 6458.257300410513, 6505.186851643544, 6548.410643042149, 10720.0, 10789.136869050613, 10880.0, 10935.781284374427, 10969.890301096886, 11049.447527623748, 11054.447277636247, 11088.611898583511, 11089.833652495057, 11090.944545277222, 7217.422606191597, 7771.33943614799, 7875.8818617719635, 7983.962084928922, 8046.235607617501, 8931.598078086372, 8989.235914947303, 8989.55052247398, 9009.324300677345, 9087.727368178965, 7369.299916507923, 7559.3196612305155, 7568.129665088585, 7575.128860181149, 7660.2722741339485, 7662.540247585162, 7700.460967732205, 7730.072391313079, 7790.376769858511, 7797.220277972157, 7344.522606030591, 7450.552966822008, 7462.179160292255, 7464.402847772274, 7478.06524184477, 5502.862428439321, 5508.366537848199, 5632.0, 5649.350324712546, 5719.628224165416, 5440.455954404528, 5551.084071128219, 5640.54875609942, 5652.039153344023, 5726.398728133652], "value": 4841.659496221425, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [356.1399220881571, 358.7399135626671, 364.3441804751447, 366.8642602237173, 367.7517675568992, 5672.404397538261, 5694.487496125348, 5699.430056994299, 5706.971465142674, 5708.457696518834, 5453.890922181564, 5581.776728930848, 5584.4136365681625, 5593.804216852411, 5615.326160860693, 4413.6027757501815, 4442.8452200682805, 4445.466544014723, 4458.910821783563, 4468.798904049326, 4410.64714822815, 4412.24991751403, 4444.755538445384, 4470.441194850644, 4471.8658440246845, 4406.735595864258, 4438.400815889862, 4455.975125721086, 4474.0, 4495.887602809923, 4311.504177019651, 4416.536263692298, 4429.822807087713, 4437.312216606431, 4440.178566965105, 3938.8424463021443, 3949.9605003949882, 3961.821718022667, 3963.7027222958395, 3967.980160099181, 5416.535476358247, 5441.700706461143, 5443.2107344434835, 5500.4224556421395, 5530.6128571000045, 4611.654125940568, 4881.658283920127, 4917.016596680678, 4944.258361245806, 5160.6129540284255, 5821.563382746311, 5837.795677151279, 5860.765569377219, 5861.0, 5881.941180588182, 4153.982274342806, 4175.645070169039, 4181.59916427997, 4201.45381100455, 4203.348480985452, 5951.345352011275, 5995.460408563206, 6085.300190478063, 6117.418845209742, 6156.384361563897, 4268.929569158955, 4288.549702281278, 4298.742075475481, 4307.440032795779, 4309.698321117555, 4276.2302785498905, 4296.548862369469, 4328.134373125387, 4336.241157797373, 4367.2575662137515, 4813.78337974792, 4860.756962151878, 4984.202527595639, 4989.501049894981, 4989.600831933437, 5861.941380586225, 5863.970680146572, 5873.353931067579, 5899.262592175978, 5903.911441328383, 1498.423107103773, 1519.8176218853807, 1523.5581681312517, 1527.0837497501411, 1533.302347431916, 935.7894473743489, 982.6708052802248, 987.1658448610913, 989.5448093876897, 996.1681995533665, 5087.465816089258, 5147.202183661539, 5158.664686795346, 5166.741662916915, 5176.378834539804, 5452.418798548456, 5462.180672899097, 5467.425920278393, 5473.28847249855, 5493.697846618395, 4973.701577905337, 5134.435212126663, 5180.870478238075, 5192.324997750344, 5208.687478751287, 2912.8639830465713, 2919.226405002676, 2924.722151395614, 2927.209653393572, 2949.348364915654, 5571.66570005801, 5640.53346130001, 5647.407022262685, 5701.344345400332, 5754.510866576388, 5122.719320169957, 5546.169763977878, 5559.444055594489, 5568.693721845257, 5588.435238133329, 5598.44015598445, 5610.719464026783, 5660.377358490563, 5663.065594176915, 5669.376368599451, 5036.496350364934, 5313.601479889101, 5424.620276580601, 5465.141851770417, 5496.560275178056, 5268.236105764566, 5281.471852814688, 5352.411234764095, 5389.568834493152, 5935.643861368331, 6342.809715708536, 6393.456556192776, 6396.0, 6463.353664633499, 6472.611643301417, 4378.540253273488, 4424.2036433441, 4443.311286750559, 4481.619062379734, 4486.461624604938, 6004.969975150097, 6126.448619624255, 6132.969335153296, 6165.815025549241, 6231.657258850807, 5919.6744179070565, 5961.970190149022, 5982.88034239304, 5987.5808693391045, 6000.339962604197, 5696.174054761954, 5962.731677074629, 5991.64050156992, 5994.6403215807195, 6003.45968862787, 5871.588988770745, 5876.324222714443, 5886.0, 5891.293044834647, 5893.8487452078825, 5968.701564921824, 5970.731317090655, 6041.124037014696, 6047.699744554941, 6090.147379366981, 5625.409332020079, 5900.262467191601, 5905.822825315247, 5948.315943666534, 5948.494377977747], "value": 4408.190477275561, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [748.300339182864, 778.5717855179649, 797.3899966525609, 802.4944285100386, 906.533135435251, 16307.347706091758, 16728.581785455368, 17059.91470042648, 17072.743908841378, 17126.14369281537, 15332.0, 15720.0, 15722.606934826606, 15736.763948540782, 15738.449154279602, 570.57207094679, 846.826400587878, 869.387082107113, 872.0538216035609, 873.2010210657241, 865.4980111535294, 867.9783005424852, 873.6592728835759, 874.7813046738315, 877.5436772878099, 905.3888625178012, 907.3648446087765, 907.7549061753323, 908.0601577367426, 908.9454632722058, 909.9818003639956, 910.0626354854511, 910.2217603948661, 910.4446287764458, 910.6812615584558, 660.7125900233414, 663.3101574362705, 665.424407887179, 665.8035879415536, 666.8432918264205, 14643.341049652685, 14681.926590367086, 14701.779473307908, 14709.117452952856, 14720.337584808709, 14240.145591264558, 14253.216073115975, 14296.142231466041, 14892.62768430787, 15948.521544353573, 13980.412278691596, 14150.858491415058, 14191.858081419157, 14326.785098223534, 14427.0, 4693.530646935314, 4705.1530724469585, 4777.880552986203, 4796.832110876137, 4918.581920536759, 66169.66915165441, 68595.0, 69088.6545567274, 78672.60663696645, 78746.6062669683, 12107.0, 12209.816852747215, 12415.0, 12635.115541911979, 12697.301648409426, 22373.440663983205, 22373.776262237494, 22391.77608223897, 22444.775552244595, 22470.775292247195, 8879.85087273345, 9159.679411220708, 9275.953620231856, 9301.627934882665, 9407.482588457564, 4956.652939682623, 5006.148954677714, 5023.447420783711, 5046.747662616928, 5135.666181698178, 3788.507494025814, 3914.8842579864604, 3917.725759196886, 3924.4898163238595, 3939.5666476687543, 659.5844617890698, 673.5077036168766, 677.8070595751512, 687.4019602945369, 688.7417218543046, 655.0, 673.7103045690302, 724.1527412926888, 750.2909750285927, 762.3405754022731, 10476.842847357295, 10787.081840947436, 10948.616798412017, 11173.608923687632, 11209.775804483865, 598.3896425645904, 613.4172536090732, 620.9875802484015, 631.848356394462, 763.904511936008, 4636.953630463652, 4797.856064318076, 4820.807167713322, 5063.949360506348, 5085.848527140271, 68779.3122068783, 104708.0, 112755.43622282, 114652.0, 118101.40949295371, 71304.0, 102334.48832755937, 102721.48639256906, 103490.0, 103922.48038759758, 90715.54642226746, 91850.0, 93363.53318233366, 95536.0, 97583.0, 9631.903680963382, 9706.0, 9710.649825810084, 9846.163076138608, 9854.359466634645, 53200.46799531955, 54023.729881350344, 54123.18815217854, 55257.894842103735, 55422.16866746922, 52212.21681674702, 68539.97190042253, 70032.29967700462, 71904.64047679729, 72245.63877180581, 13937.721245574829, 13952.372143253375, 14155.64610884736, 14162.221077840817, 14363.712725745218, 14064.367103480163, 14297.213653248755, 14538.491152809602, 14981.0262332948, 15425.69148616999, 14847.851521484647, 15050.548483545073, 15120.54638360851, 15271.312790924212, 15357.692846143238, 14833.480828170963, 14944.925275373553, 14960.0, 15229.31468083961, 15286.159261240738, 13983.300834958414, 14816.111033338035, 15036.097834129987, 15331.77002344988, 15428.228588570302, 11549.595764148215, 11757.353345565734, 11774.587889423829, 11837.112216583619, 12038.458269377725, 11725.179237453296, 11952.701182470508, 12279.75440491203, 12287.631371058882, 12296.938515307365], "value": 7939.59628772042, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1518.6, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 104.0, 114.0, 110.0, 113.0, 112.0, 118.0, 109.0, 109.0, 111.0], "value": 111.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 130.0, 152.0, 175.0, 133.0, 152.0, 153.0, 130.0, 174.0, 131.0], "value": 147.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 162.0, 162.0, 163.0, 162.0, 162.0, 162.0, 162.0, 163.0, 159.0], "value": 161.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 74.0, 75.0, 164.0, 75.0, 76.0, 76.0, 77.0, 182.0, 77.0], "value": 95.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 147.0, 86.0, 85.0, 88.0, 150.0, 85.0, 85.0, 143.0], "value": 103.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 118.0, 118.0, 118.0], "value": 117.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 147.0, 146.0, 147.0, 148.0, 146.0, 147.0, 146.0, 147.0], "value": 146.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 95.0, 96.0, 96.0, 95.0, 96.0, 96.0, 96.0, 96.0, 96.0], "value": 95.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 51.0, 52.0, 53.0, 54.0, 55.0, 52.0, 53.0, 60.0, 52.0], "value": 53.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 59.0, 59.0, 59.0, 59.0, 60.0, 60.0, 60.0, 60.0, 60.0], "value": 60.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 84.0, 76.0, 79.0, 80.0, 79.0, 78.0, 78.0, 107.0, 78.0], "value": 81.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [129.0, 122.0, 119.0, 128.0, 124.0, 119.0, 124.0, 128.0, 124.0, 134.0], "value": 125.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 156.0, 157.0, 156.0, 158.0, 154.0, 156.0, 155.0, 156.0, 155.0], "value": 156.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 63.0, 64.0, 61.0, 61.0, 66.0, 61.0, 62.0, 63.0, 61.0], "value": 62.5, "unit": "score"}]}]} 00:15:39 INFO - Return code: 0 00:15:39 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 00:15:39 ERROR - # TBPL SUCCESS # 00:15:39 INFO - Running post-action listener: _resource_record_post_action 00:15:39 INFO - ##### 00:15:39 INFO - ##### Finished run-tests step (success) 00:15:39 INFO - ##### 00:15:39 INFO - Running post-run listener: _resource_record_post_run 00:15:39 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 7991296; Write bytes: 466538496; Read time: 1652; Write time: 422784 00:15:39 INFO - TinderboxPrint: CPU usage
13.4% 00:15:39 INFO - TinderboxPrint: I/O read bytes / time
7,991,296 / 1,652 00:15:39 INFO - TinderboxPrint: I/O write bytes / time
466,538,496 / 422,784 00:15:39 INFO - TinderboxPrint: CPU idle
8,221.8 (86.6%) 00:15:39 INFO - TinderboxPrint: CPU user
1,215.6 (12.8%) 00:15:39 INFO - TinderboxPrint: Swap in / out
0 / 0 00:15:39 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 90161152; Read time: 0; Write time: 108452 00:15:39 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 6230016; Write bytes: 376377344; Read time: 1592; Write time: 314332 00:15:40 INFO - Running post-run listener: _upload_blobber_files 00:15:40 INFO - Blob upload gear active. 00:15:40 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 00:15:40 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 00:15:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 00:15:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 00:15:40 INFO - (blobuploader) - INFO - Open directory for files ... 00:15:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 00:15:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 00:15:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 00:15:41 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 00:15:41 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 00:15:41 INFO - (blobuploader) - INFO - Done attempting. 00:15:41 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 00:15:41 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 00:15:41 INFO - (blobuploader) - INFO - Uploading, attempt #1. 00:15:44 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 00:15:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 00:15:44 INFO - (blobuploader) - INFO - Done attempting. 00:15:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 00:15:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 00:15:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 00:15:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 00:15:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 00:15:45 INFO - (blobuploader) - INFO - Done attempting. 00:15:45 INFO - (blobuploader) - INFO - Iteration through files over. 00:15:45 INFO - Return code: 0 00:15:45 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 00:15:45 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 00:15:45 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7dbcc85ab2f84d3a899d8dabdbb8104f05a0202f4d516101fe9a09951b3c8b488f077ade7e9cdf764624ee41331ffa71e4bafde2ca6f80390d8464abb5e97322", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/db6107307dbfa21e7a9facd58927d0d2c96e8c9a7114c65726f8b07239ac3c879b9e837c88684a8550b991a287f4ec9b9b9b3bceca8facdc2ef852712a42ae69", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ebcd9cacd74042463e02e3e300e85a392c095366df078e06b38fa51e033094b2119a66e597fe7576f4b94314094e92cd9a0b8c697eaa0154b269333ec851913f"} 00:15:45 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 00:15:45 INFO - Writing to file /builds/slave/test/properties/blobber_files 00:15:45 INFO - Contents: 00:15:45 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7dbcc85ab2f84d3a899d8dabdbb8104f05a0202f4d516101fe9a09951b3c8b488f077ade7e9cdf764624ee41331ffa71e4bafde2ca6f80390d8464abb5e97322", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/db6107307dbfa21e7a9facd58927d0d2c96e8c9a7114c65726f8b07239ac3c879b9e837c88684a8550b991a287f4ec9b9b9b3bceca8facdc2ef852712a42ae69", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ebcd9cacd74042463e02e3e300e85a392c095366df078e06b38fa51e033094b2119a66e597fe7576f4b94314094e92cd9a0b8c697eaa0154b269333ec851913f"} 00:15:45 INFO - Running post-run listener: copy_logs_to_upload_dir 00:15:45 INFO - Copying logs to upload dir... 00:15:45 INFO - mkdir: /builds/slave/test/build/upload/logs 00:15:45 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1238.834975 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-07-07 00:15:45.573190) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-07 00:15:45.576525) ========= 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=db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261 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-Aurora/sha512/7dbcc85ab2f84d3a899d8dabdbb8104f05a0202f4d516101fe9a09951b3c8b488f077ade7e9cdf764624ee41331ffa71e4bafde2ca6f80390d8464abb5e97322", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/db6107307dbfa21e7a9facd58927d0d2c96e8c9a7114c65726f8b07239ac3c879b9e837c88684a8550b991a287f4ec9b9b9b3bceca8facdc2ef852712a42ae69", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ebcd9cacd74042463e02e3e300e85a392c095366df078e06b38fa51e033094b2119a66e597fe7576f4b94314094e92cd9a0b8c697eaa0154b269333ec851913f"} build_url:https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011481 build_url: 'https://queue.taskcluster.net/v1/task/GBAGl25dS0e-LFxcFgUQmw/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7dbcc85ab2f84d3a899d8dabdbb8104f05a0202f4d516101fe9a09951b3c8b488f077ade7e9cdf764624ee41331ffa71e4bafde2ca6f80390d8464abb5e97322", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/db6107307dbfa21e7a9facd58927d0d2c96e8c9a7114c65726f8b07239ac3c879b9e837c88684a8550b991a287f4ec9b9b9b3bceca8facdc2ef852712a42ae69", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ebcd9cacd74042463e02e3e300e85a392c095366df078e06b38fa51e033094b2119a66e597fe7576f4b94314094e92cd9a0b8c697eaa0154b269333ec851913f"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-07 00:15:45.602197) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-07 00:15:45.602531) ========= 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=db0483c52d987ecb441a263b000001ad-1467873730.285210-1109934261 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004496 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-07 00:15:45.685676) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-07 00:15:45.685975) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-07 00:15:45.686261) ========= ========= Total master_lag: 0.21 =========