builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-055 starttime: 1467810240.87 results: success (0) buildid: 20160706033324 builduid: 4a585a34ecf04bb885792c4cca0dd41b revision: 65cb053a14bcc2279217cbb551d6839e37de0830 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:00.873992) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:00.874443) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:00.874787) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:00.932040) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:00.932385) ========= 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=bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-06 06:04:01-- 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% 225M=0s 2016-07-06 06:04:01 (225 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.124116 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:01.073118) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:01.073680) ========= 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=bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017819 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:01.127897) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:01.128257) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 65cb053a14bcc2279217cbb551d6839e37de0830 --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 65cb053a14bcc2279217cbb551d6839e37de0830 --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=bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-06 06:04:01,614 truncating revision to first 12 chars 2016-07-06 06:04:01,614 Setting DEBUG logging. 2016-07-06 06:04:01,614 attempt 1/10 2016-07-06 06:04:01,614 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/65cb053a14bc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-06 06:04:02,265 unpacking tar archive at: mozilla-aurora-65cb053a14bc/testing/mozharness/ program finished with exit code 0 elapsedTime=0.979118 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:02.121125) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:02.121441) ========= script_repo_revision: 65cb053a14bcc2279217cbb551d6839e37de0830 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:02.121834) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:02.122113) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-06 06:04:02.132195) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-07-06 06:04:02.132603) ========= /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=bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 06:04:02 INFO - MultiFileLogger online at 20160706 06:04:02 in /builds/slave/test 06:04:02 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 06:04:02 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 06:04:02 INFO - {'append_to_log': False, 06:04:02 INFO - 'base_work_dir': '/builds/slave/test', 06:04:02 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 06:04:02 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 06:04:02 INFO - 'branch': 'Mozilla-Aurora', 06:04:02 INFO - 'buildbot_json_path': 'buildprops.json', 06:04:02 INFO - 'config_files': ('talos/linux_config.py',), 06:04:02 INFO - 'default_actions': ('clobber', 06:04:02 INFO - 'read-buildbot-config', 06:04:02 INFO - 'download-and-extract', 06:04:02 INFO - 'populate-webroot', 06:04:02 INFO - 'create-virtualenv', 06:04:02 INFO - 'install', 06:04:02 INFO - 'run-tests'), 06:04:02 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:04:02 INFO - 'download_minidump_stackwalk': True, 06:04:02 INFO - 'download_symbols': 'ondemand', 06:04:02 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:04:02 INFO - 'tooltool.py': '/tools/tooltool.py', 06:04:02 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:04:02 INFO - '/tools/misc-python/virtualenv.py')}, 06:04:02 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:04:02 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:04:02 INFO - 'installer_path': 'installer.exe', 06:04:02 INFO - 'log_level': 'info', 06:04:02 INFO - 'log_name': 'talos', 06:04:02 INFO - 'log_to_console': True, 06:04:02 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 06:04:02 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 06:04:02 INFO - 'opt_config_files': (), 06:04:02 INFO - 'pip_index': False, 06:04:02 INFO - 'sps_profile': False, 06:04:02 INFO - 'sps_profile_interval': 0, 06:04:02 INFO - 'suite': 'dromaeojs-e10s', 06:04:02 INFO - 'system_bits': '32', 06:04:02 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:04:02 INFO - 'title': 'talos-linux64-ix-055', 06:04:02 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:04:02 INFO - 'use_talos_json': True, 06:04:02 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 06:04:02 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:04:02 INFO - 'work_dir': 'build'} 06:04:02 INFO - ##### 06:04:02 INFO - ##### Running clobber step. 06:04:02 INFO - ##### 06:04:02 INFO - Running pre-action listener: _resource_record_pre_action 06:04:02 INFO - Running main action method: clobber 06:04:02 INFO - rmtree: /builds/slave/test/build 06:04:02 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 06:04:03 INFO - Running post-action listener: _resource_record_post_action 06:04:03 INFO - ##### 06:04:03 INFO - ##### Finished clobber step (success) 06:04:03 INFO - ##### 06:04:03 INFO - ##### 06:04:03 INFO - ##### Running read-buildbot-config step. 06:04:03 INFO - ##### 06:04:03 INFO - Running pre-action listener: _resource_record_pre_action 06:04:03 INFO - Running main action method: read_buildbot_config 06:04:03 INFO - Using buildbot properties: 06:04:03 INFO - { 06:04:03 INFO - "project": "", 06:04:03 INFO - "product": "firefox", 06:04:03 INFO - "script_repo_revision": "production", 06:04:03 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 06:04:03 INFO - "repository": "", 06:04:03 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 06:04:03 INFO - "buildid": "20160706033324", 06:04:03 INFO - "pgo_build": "True", 06:04:03 INFO - "basedir": "/builds/slave/test", 06:04:03 INFO - "buildnumber": 401, 06:04:03 INFO - "slavename": "talos-linux64-ix-055", 06:04:03 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 06:04:03 INFO - "platform": "ubuntu64_hw", 06:04:03 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 06:04:03 INFO - "branch": "mozilla-aurora", 06:04:03 INFO - "repo_path": "releases/mozilla-aurora", 06:04:03 INFO - "revision": "65cb053a14bcc2279217cbb551d6839e37de0830", 06:04:03 INFO - "stage_platform": "linux64-pgo", 06:04:03 INFO - "builduid": "4a585a34ecf04bb885792c4cca0dd41b", 06:04:03 INFO - "slavebuilddir": "test" 06:04:03 INFO - } 06:04:03 INFO - Found installer url https://queue.taskcluster.net/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2. 06:04:03 INFO - Running post-action listener: _resource_record_post_action 06:04:03 INFO - ##### 06:04:03 INFO - ##### Finished read-buildbot-config step (success) 06:04:03 INFO - ##### 06:04:03 INFO - ##### 06:04:03 INFO - ##### Running download-and-extract step. 06:04:03 INFO - ##### 06:04:03 INFO - Running pre-action listener: _resource_record_pre_action 06:04:03 INFO - Running main action method: download_and_extract 06:04:03 INFO - mkdir: /builds/slave/test/build/tests 06:04:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:03 INFO - https://queue.taskcluster.net/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 06:04:03 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json 06:04:03 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json 06:04:03 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/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 06:04:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/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 06:04:08 INFO - Downloaded 1361 bytes. 06:04:08 INFO - Reading from file /builds/slave/test/build/firefox-49.0a2.en-US.linux-x86_64.test_packages.json 06:04:08 INFO - Using the following test package requirements: 06:04:08 INFO - {u'common': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'], 06:04:08 INFO - u'cppunittest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 06:04:08 INFO - u'firefox-49.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 06:04:08 INFO - u'gtest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 06:04:08 INFO - u'firefox-49.0a2.en-US.linux-x86_64.gtest.tests.zip'], 06:04:08 INFO - u'jittest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 06:04:08 INFO - u'jsshell-linux-x86_64.zip'], 06:04:08 INFO - u'mochitest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 06:04:08 INFO - u'firefox-49.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 06:04:08 INFO - u'mozbase': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'], 06:04:08 INFO - u'reftest': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 06:04:08 INFO - u'firefox-49.0a2.en-US.linux-x86_64.reftest.tests.zip'], 06:04:08 INFO - u'talos': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 06:04:08 INFO - u'firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip'], 06:04:08 INFO - u'web-platform': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 06:04:08 INFO - u'firefox-49.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 06:04:08 INFO - u'xpcshell': [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip', 06:04:08 INFO - u'firefox-49.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 06:04:08 INFO - Downloading packages: [u'firefox-49.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 06:04:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:08 INFO - https://queue.taskcluster.net/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:04:08 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 06:04:08 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 06:04:08 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/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 06:04:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/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 06:04:09 INFO - Downloaded 24526733 bytes. 06:04:09 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'] 06:04:09 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 06:04:11 INFO - Return code: 0 06:04:11 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 06:04:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:11 INFO - https://queue.taskcluster.net/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:04:11 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 06:04:11 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.common.tests.zip 06:04:11 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/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 06:04:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/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 06:04:14 INFO - Downloaded 24526733 bytes. 06:04:14 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'] 06:04:14 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 06:04:15 INFO - Return code: 0 06:04:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:15 INFO - https://queue.taskcluster.net/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 06:04:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip 06:04:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.talos.tests.zip 06:04:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/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 06:04:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/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 06:04:16 INFO - Downloaded 10833369 bytes. 06:04:16 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'] 06:04:16 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 06:04:16 INFO - Return code: 0 06:04:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:16 INFO - https://queue.taskcluster.net/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 06:04:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 06:04:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 06:04:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/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 06:04:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bmkoLsHkT9aVlMexqqw9-w/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 06:04:18 INFO - Downloaded 63635787 bytes. 06:04:18 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 06:04:18 INFO - mkdir: /builds/slave/test/properties 06:04:18 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 06:04:18 INFO - Writing to file /builds/slave/test/properties/build_url 06:04:18 INFO - Contents: 06:04:18 INFO - build_url:https://queue.taskcluster.net/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 06:04:19 INFO - Running post-action listener: _resource_record_post_action 06:04:19 INFO - Running post-action listener: set_extra_try_arguments 06:04:19 INFO - ##### 06:04:19 INFO - ##### Finished download-and-extract step (success) 06:04:19 INFO - ##### 06:04:19 INFO - ##### 06:04:19 INFO - ##### Running populate-webroot step. 06:04:19 INFO - ##### 06:04:19 INFO - Running pre-action listener: _resource_record_pre_action 06:04:19 INFO - Running main action method: populate_webroot 06:04:19 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:04:19 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:04:19 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:04:19 INFO - '--tppagecycles', 06:04:19 INFO - '7'], 06:04:19 INFO - 'tests': ['tsvgm']}}, 06:04:19 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 06:04:19 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:04:19 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 06:04:19 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 06:04:19 INFO - 'tests': ['dromaeo_css', 'kraken']}, 06:04:19 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 06:04:19 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:04:19 INFO - 'talos_options': ['--disable-e10s'], 06:04:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:04:19 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:04:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:04:19 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:04:19 INFO - 'talos_options': ['--disable-e10s'], 06:04:19 INFO - 'tests': ['damp', 'tps']}, 06:04:19 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:04:19 INFO - 'tests': ['damp', 'tps']}, 06:04:19 INFO - 'g3': {'talos_options': ['--disable-e10s'], 06:04:19 INFO - 'tests': ['dromaeo_dom']}, 06:04:19 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:04:19 INFO - 'other': {'talos_options': ['--disable-e10s'], 06:04:19 INFO - 'tests': ['a11yr', 06:04:19 INFO - 'ts_paint', 06:04:19 INFO - 'tpaint', 06:04:19 INFO - 'sessionrestore', 06:04:19 INFO - 'sessionrestore_no_auto_restore', 06:04:19 INFO - 'tabpaint']}, 06:04:19 INFO - 'other-e10s': {'tests': ['a11yr', 06:04:19 INFO - 'ts_paint', 06:04:19 INFO - 'tpaint', 06:04:19 INFO - 'sessionrestore', 06:04:19 INFO - 'sessionrestore_no_auto_restore', 06:04:19 INFO - 'tabpaint']}, 06:04:19 INFO - 'other-e10s_l64': {'tests': ['a11yr', 06:04:19 INFO - 'ts_paint', 06:04:19 INFO - 'tpaint', 06:04:19 INFO - 'sessionrestore', 06:04:19 INFO - 'sessionrestore_no_auto_restore', 06:04:19 INFO - 'tabpaint']}, 06:04:19 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 06:04:19 INFO - 'ts_paint', 06:04:19 INFO - 'tpaint', 06:04:19 INFO - 'sessionrestore', 06:04:19 INFO - 'sessionrestore_no_auto_restore', 06:04:19 INFO - 'tabpaint']}, 06:04:19 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 06:04:19 INFO - 'tests': ['a11yr', 06:04:19 INFO - 'ts_paint', 06:04:19 INFO - 'tpaint', 06:04:19 INFO - 'sessionrestore', 06:04:19 INFO - 'sessionrestore_no_auto_restore', 06:04:19 INFO - 'tabpaint']}, 06:04:19 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 06:04:19 INFO - 'tests': ['a11yr', 06:04:19 INFO - 'ts_paint', 06:04:19 INFO - 'tpaint', 06:04:19 INFO - 'sessionrestore', 06:04:19 INFO - 'sessionrestore_no_auto_restore', 06:04:19 INFO - 'tabpaint']}, 06:04:19 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 06:04:19 INFO - 'tests': ['tsvgx', 06:04:19 INFO - 'tsvgr_opacity', 06:04:19 INFO - 'tart', 06:04:19 INFO - 'tscrollx', 06:04:19 INFO - 'cart']}, 06:04:19 INFO - 'svgr-e10s': {'tests': ['tsvgx', 06:04:19 INFO - 'tsvgr_opacity', 06:04:19 INFO - 'tart', 06:04:19 INFO - 'tscrollx', 06:04:19 INFO - 'cart']}, 06:04:19 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:04:19 INFO - 'talos_options': ['--disable-e10s'], 06:04:19 INFO - 'tests': ['tp5o']}, 06:04:19 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:04:19 INFO - 'tests': ['tp5o']}, 06:04:19 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:04:19 INFO - 'talos_options': ['--disable-e10s', 06:04:19 INFO - '--xperf_path', 06:04:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:04:19 INFO - 'tests': ['tp5n']}, 06:04:19 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:04:19 INFO - 'talos_options': ['--xperf_path', 06:04:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:04:19 INFO - 'tests': ['tp5n']}}, 06:04:19 INFO - 'talos.zip': {'path': '', 06:04:19 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:04:19 INFO - Running post-action listener: _resource_record_post_action 06:04:19 INFO - ##### 06:04:19 INFO - ##### Finished populate-webroot step (success) 06:04:19 INFO - ##### 06:04:19 INFO - ##### 06:04:19 INFO - ##### Running create-virtualenv step. 06:04:19 INFO - ##### 06:04:19 INFO - Running pre-action listener: _resource_record_pre_action 06:04:19 INFO - Running main action method: create_virtualenv 06:04:19 INFO - Creating virtualenv /builds/slave/test/build/venv 06:04:19 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 06:04:19 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 06:04:19 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:04:19 INFO - Using real prefix '/usr' 06:04:19 INFO - New python executable in /builds/slave/test/build/venv/bin/python 06:04:20 INFO - Installing distribute.............................................................................................................................................................................................done. 06:04:22 INFO - Installing pip.................done. 06:04:22 INFO - Return code: 0 06:04:22 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 06:04:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:04:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:04:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff65989ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fb08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x207d020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x210f2e0>, '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 0x207b140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x207b5d0>, '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': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:04:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 06:04:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 06:04:22 INFO - Using env: {'DISPLAY': ':0', 06:04:22 INFO - 'HOME': '/home/cltbld', 06:04:22 INFO - 'LANG': 'en_US.UTF-8', 06:04:22 INFO - 'LANGUAGE': 'en_US:en', 06:04:22 INFO - 'LOGNAME': 'cltbld', 06:04:22 INFO - 'MAIL': '/var/mail/cltbld', 06:04:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:04:22 INFO - 'MOZ_NO_REMOTE': '1', 06:04:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:04:22 INFO - 'NO_EM_RESTART': '1', 06:04:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:04:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:04:22 INFO - 'PWD': '/builds/slave/test', 06:04:22 INFO - 'SHELL': '/bin/bash', 06:04:22 INFO - 'SHLVL': '1', 06:04:22 INFO - 'TERM': 'linux', 06:04:22 INFO - 'TMOUT': '86400', 06:04:22 INFO - 'USER': 'cltbld', 06:04:22 INFO - 'XDG_SESSION_COOKIE': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 06:04:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:04:22 INFO - '_': '/tools/buildbot/bin/python'} 06:04:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:04:22 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 06:04:22 INFO - Cleaning up... 06:04:22 INFO - Return code: 0 06:04:22 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 06:04:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:04:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:04:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7ff65989ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fb08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x207d020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x210f2e0>, '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 0x207b140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x207b5d0>, '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': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:04:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 06:04:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 06:04:22 INFO - Using env: {'DISPLAY': ':0', 06:04:22 INFO - 'HOME': '/home/cltbld', 06:04:22 INFO - 'LANG': 'en_US.UTF-8', 06:04:22 INFO - 'LANGUAGE': 'en_US:en', 06:04:22 INFO - 'LOGNAME': 'cltbld', 06:04:22 INFO - 'MAIL': '/var/mail/cltbld', 06:04:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:04:22 INFO - 'MOZ_NO_REMOTE': '1', 06:04:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:04:22 INFO - 'NO_EM_RESTART': '1', 06:04:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:04:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:04:22 INFO - 'PWD': '/builds/slave/test', 06:04:22 INFO - 'SHELL': '/bin/bash', 06:04:22 INFO - 'SHLVL': '1', 06:04:22 INFO - 'TERM': 'linux', 06:04:22 INFO - 'TMOUT': '86400', 06:04:22 INFO - 'USER': 'cltbld', 06:04:22 INFO - 'XDG_SESSION_COOKIE': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 06:04:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:04:22 INFO - '_': '/tools/buildbot/bin/python'} 06:04:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:04:22 INFO - Downloading/unpacking psutil>=3.1.1 06:04:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:04:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:04:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:04:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:04:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:04:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:04:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 06:04:24 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:04:24 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:04:24 INFO - Installing collected packages: psutil 06:04:24 INFO - Running setup.py install for psutil 06:04:24 INFO - building 'psutil._psutil_linux' extension 06:04:24 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 06:04:24 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 06:04:24 INFO - building 'psutil._psutil_posix' extension 06:04:24 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 06:04:25 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 06:04:25 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:04:25 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:04:25 INFO - Successfully installed psutil 06:04:25 INFO - Cleaning up... 06:04:25 INFO - Return code: 0 06:04:25 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 06:04:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:04:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:04:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:25 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 0x7ff65989ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fb08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x207d020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x210f2e0>, '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 0x207b140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x207b5d0>, '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': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:04:25 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 06:04:25 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 06:04:25 INFO - Using env: {'DISPLAY': ':0', 06:04:25 INFO - 'HOME': '/home/cltbld', 06:04:25 INFO - 'LANG': 'en_US.UTF-8', 06:04:25 INFO - 'LANGUAGE': 'en_US:en', 06:04:25 INFO - 'LOGNAME': 'cltbld', 06:04:25 INFO - 'MAIL': '/var/mail/cltbld', 06:04:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:04:25 INFO - 'MOZ_NO_REMOTE': '1', 06:04:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:04:25 INFO - 'NO_EM_RESTART': '1', 06:04:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:04:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:04:25 INFO - 'PWD': '/builds/slave/test', 06:04:25 INFO - 'SHELL': '/bin/bash', 06:04:25 INFO - 'SHLVL': '1', 06:04:25 INFO - 'TERM': 'linux', 06:04:25 INFO - 'TMOUT': '86400', 06:04:25 INFO - 'USER': 'cltbld', 06:04:25 INFO - 'XDG_SESSION_COOKIE': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 06:04:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:04:25 INFO - '_': '/tools/buildbot/bin/python'} 06:04:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:04:25 INFO - Downloading/unpacking mozsystemmonitor==0.3 06:04:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:04:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:04:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:04:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:04:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:04:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:04:27 INFO - Downloading mozsystemmonitor-0.3.tar.gz 06:04:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:04:27 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 06:04:27 INFO - Installing collected packages: mozsystemmonitor 06:04:27 INFO - Running setup.py install for mozsystemmonitor 06:04:27 INFO - Successfully installed mozsystemmonitor 06:04:27 INFO - Cleaning up... 06:04:27 INFO - Return code: 0 06:04:27 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 06:04:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:04:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:04:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:27 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 0x7ff65989ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fb08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x207d020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x210f2e0>, '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 0x207b140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x207b5d0>, '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': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:04:27 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 06:04:27 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 06:04:27 INFO - Using env: {'DISPLAY': ':0', 06:04:27 INFO - 'HOME': '/home/cltbld', 06:04:27 INFO - 'LANG': 'en_US.UTF-8', 06:04:27 INFO - 'LANGUAGE': 'en_US:en', 06:04:27 INFO - 'LOGNAME': 'cltbld', 06:04:27 INFO - 'MAIL': '/var/mail/cltbld', 06:04:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:04:27 INFO - 'MOZ_NO_REMOTE': '1', 06:04:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:04:27 INFO - 'NO_EM_RESTART': '1', 06:04:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:04:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:04:27 INFO - 'PWD': '/builds/slave/test', 06:04:27 INFO - 'SHELL': '/bin/bash', 06:04:27 INFO - 'SHLVL': '1', 06:04:27 INFO - 'TERM': 'linux', 06:04:27 INFO - 'TMOUT': '86400', 06:04:27 INFO - 'USER': 'cltbld', 06:04:27 INFO - 'XDG_SESSION_COOKIE': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 06:04:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:04:27 INFO - '_': '/tools/buildbot/bin/python'} 06:04:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:04:27 INFO - Downloading/unpacking jsonschema==2.5.1 06:04:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:04:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:04:27 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:04:27 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:04:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:04:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:04:29 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 06:04:29 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 06:04:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:04:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:04:29 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:04:29 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:04:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:04:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:04:29 INFO - Downloading functools32-3.2.3-2.tar.gz 06:04:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 06:04:29 INFO - warning: no files found matching '*.txt' 06:04:29 INFO - no previously-included directories found matching 'build' 06:04:29 INFO - no previously-included directories found matching 'dist' 06:04:29 INFO - no previously-included directories found matching '.git*' 06:04:29 INFO - Installing collected packages: jsonschema, functools32 06:04:29 INFO - Running setup.py install for functools32 06:04:30 INFO - warning: no files found matching '*.txt' 06:04:30 INFO - no previously-included directories found matching 'build' 06:04:30 INFO - no previously-included directories found matching 'dist' 06:04:30 INFO - no previously-included directories found matching '.git*' 06:04:30 INFO - Successfully installed jsonschema functools32 06:04:30 INFO - Cleaning up... 06:04:30 INFO - Return code: 0 06:04:30 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 06:04: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')]} 06:04:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:04:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04: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')]} 06:04:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:04:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04: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', '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 0x7ff65989ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fb08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x207d020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x210f2e0>, '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 0x207b140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x207b5d0>, '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': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:04: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', 'blobuploader==1.2.4'] in /builds/slave/test/build 06:04: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 blobuploader==1.2.4 06:04:30 INFO - Using env: {'DISPLAY': ':0', 06:04:30 INFO - 'HOME': '/home/cltbld', 06:04:30 INFO - 'LANG': 'en_US.UTF-8', 06:04:30 INFO - 'LANGUAGE': 'en_US:en', 06:04:30 INFO - 'LOGNAME': 'cltbld', 06:04:30 INFO - 'MAIL': '/var/mail/cltbld', 06:04:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:04:30 INFO - 'MOZ_NO_REMOTE': '1', 06:04:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:04:30 INFO - 'NO_EM_RESTART': '1', 06:04:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:04:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:04:30 INFO - 'PWD': '/builds/slave/test', 06:04:30 INFO - 'SHELL': '/bin/bash', 06:04:30 INFO - 'SHLVL': '1', 06:04:30 INFO - 'TERM': 'linux', 06:04:30 INFO - 'TMOUT': '86400', 06:04:30 INFO - 'USER': 'cltbld', 06:04:30 INFO - 'XDG_SESSION_COOKIE': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 06:04:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:04:30 INFO - '_': '/tools/buildbot/bin/python'} 06:04:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:04:30 INFO - Downloading/unpacking blobuploader==1.2.4 06:04: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 06:04: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 06:04: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 06:04: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 06:04: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 06:04: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 06:04:32 INFO - Downloading blobuploader-1.2.4.tar.gz 06:04:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:04:32 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:04: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 06:04: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 06:04: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 06:04: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 06:04: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 06:04: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 06:04:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 06:04:32 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:04: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 06:04: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 06:04: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 06:04: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 06:04: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 06:04: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 06:04:32 INFO - Downloading docopt-0.6.1.tar.gz 06:04:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 06:04:33 INFO - Installing collected packages: blobuploader, requests, docopt 06:04:33 INFO - Running setup.py install for blobuploader 06:04:33 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:04:33 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 06:04:33 INFO - Running setup.py install for requests 06:04:33 INFO - Running setup.py install for docopt 06:04:33 INFO - Successfully installed blobuploader requests docopt 06:04:33 INFO - Cleaning up... 06:04:33 INFO - Return code: 0 06:04:33 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:04:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:04:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:04:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:33 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 0x7ff65989ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fb08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x207d020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x210f2e0>, '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 0x207b140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x207b5d0>, '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': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:04:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 06:04:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:04:33 INFO - Using env: {'DISPLAY': ':0', 06:04:33 INFO - 'HOME': '/home/cltbld', 06:04:33 INFO - 'LANG': 'en_US.UTF-8', 06:04:33 INFO - 'LANGUAGE': 'en_US:en', 06:04:33 INFO - 'LOGNAME': 'cltbld', 06:04:33 INFO - 'MAIL': '/var/mail/cltbld', 06:04:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:04:33 INFO - 'MOZ_NO_REMOTE': '1', 06:04:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:04:33 INFO - 'NO_EM_RESTART': '1', 06:04:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:04:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:04:33 INFO - 'PWD': '/builds/slave/test', 06:04:33 INFO - 'SHELL': '/bin/bash', 06:04:33 INFO - 'SHLVL': '1', 06:04:33 INFO - 'TERM': 'linux', 06:04:33 INFO - 'TMOUT': '86400', 06:04:33 INFO - 'USER': 'cltbld', 06:04:33 INFO - 'XDG_SESSION_COOKIE': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 06:04:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:04:33 INFO - '_': '/tools/buildbot/bin/python'} 06:04:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:04:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:04:33 INFO - Running setup.py (path:/tmp/pip-JkOJJ0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:04:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:04:33 INFO - Running setup.py (path:/tmp/pip-NWybYW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:04:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:04:33 INFO - Running setup.py (path:/tmp/pip-wfo0Ii-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:04:34 INFO - Running setup.py (path:/tmp/pip-azdoLB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:04:34 INFO - Running setup.py (path:/tmp/pip-R_6yWF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:04:34 INFO - Running setup.py (path:/tmp/pip-5ehOEy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:04:34 INFO - Running setup.py (path:/tmp/pip-tPiMfc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:04:34 INFO - Running setup.py (path:/tmp/pip-06VqO4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:04:34 INFO - Running setup.py (path:/tmp/pip-ZEr8ej-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:04:34 INFO - Running setup.py (path:/tmp/pip-2u3vN4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:04:34 INFO - Running setup.py (path:/tmp/pip-_rcisW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:04:34 INFO - Running setup.py (path:/tmp/pip-xqG8Ax-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:04:34 INFO - Running setup.py (path:/tmp/pip-_vc0NU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:04:34 INFO - Running setup.py (path:/tmp/pip-wDMPSB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:04:34 INFO - Running setup.py (path:/tmp/pip-xxX0oJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:04:34 INFO - Running setup.py (path:/tmp/pip-oF_PoA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:04:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:04:34 INFO - Running setup.py (path:/tmp/pip-Pd6Hxn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:04:35 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 06:04:35 INFO - Running setup.py install for manifestparser 06:04:35 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 06:04:35 INFO - Running setup.py install for mozcrash 06:04:35 INFO - Running setup.py install for mozdebug 06:04:35 INFO - Running setup.py install for mozdevice 06:04:35 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 06:04:35 INFO - Installing dm script to /builds/slave/test/build/venv/bin 06:04:35 INFO - Running setup.py install for mozfile 06:04:35 INFO - Running setup.py install for mozhttpd 06:04:35 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 06:04:35 INFO - Running setup.py install for mozinfo 06:04:35 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 06:04:35 INFO - Running setup.py install for mozInstall 06:04:35 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 06:04:35 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 06:04:35 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 06:04:35 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 06:04:35 INFO - Running setup.py install for mozleak 06:04:35 INFO - Running setup.py install for mozlog 06:04:36 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 06:04:36 INFO - Running setup.py install for moznetwork 06:04:36 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 06:04:36 INFO - Running setup.py install for mozprocess 06:04:36 INFO - Running setup.py install for mozprofile 06:04:36 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 06:04:36 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 06:04:36 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 06:04:36 INFO - Running setup.py install for mozrunner 06:04:36 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 06:04:36 INFO - Running setup.py install for mozscreenshot 06:04:36 INFO - Running setup.py install for moztest 06:04:36 INFO - Running setup.py install for mozversion 06:04:36 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 06:04:36 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 06:04:36 INFO - Cleaning up... 06:04:36 INFO - Return code: 0 06:04:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:04:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:04:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:04:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:36 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 0x7ff65989ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fb08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x207d020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x210f2e0>, '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 0x207b140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x207b5d0>, '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': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:04:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 06:04:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:04:36 INFO - Using env: {'DISPLAY': ':0', 06:04:36 INFO - 'HOME': '/home/cltbld', 06:04:36 INFO - 'LANG': 'en_US.UTF-8', 06:04:36 INFO - 'LANGUAGE': 'en_US:en', 06:04:36 INFO - 'LOGNAME': 'cltbld', 06:04:36 INFO - 'MAIL': '/var/mail/cltbld', 06:04:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:04:36 INFO - 'MOZ_NO_REMOTE': '1', 06:04:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:04:36 INFO - 'NO_EM_RESTART': '1', 06:04:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:04:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:04:36 INFO - 'PWD': '/builds/slave/test', 06:04:36 INFO - 'SHELL': '/bin/bash', 06:04:36 INFO - 'SHLVL': '1', 06:04:36 INFO - 'TERM': 'linux', 06:04:36 INFO - 'TMOUT': '86400', 06:04:36 INFO - 'USER': 'cltbld', 06:04:36 INFO - 'XDG_SESSION_COOKIE': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 06:04:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:04:36 INFO - '_': '/tools/buildbot/bin/python'} 06:04:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:04:37 INFO - Running setup.py (path:/tmp/pip-A5usB_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:04:37 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:04:37 INFO - Running setup.py (path:/tmp/pip-FQLmdV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:04:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:04:37 INFO - Running setup.py (path:/tmp/pip-Vr6Csa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:04:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:04:37 INFO - Running setup.py (path:/tmp/pip-ERNFVC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:04:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:04:37 INFO - Running setup.py (path:/tmp/pip-QmIHBQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:04:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:04:37 INFO - Running setup.py (path:/tmp/pip-iWSKZF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:04:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:04:37 INFO - Running setup.py (path:/tmp/pip-Wa4YCI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:04:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:04:37 INFO - Running setup.py (path:/tmp/pip-1AB5sF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:04:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:04:37 INFO - Running setup.py (path:/tmp/pip-NMKREA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:04:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:04:37 INFO - Running setup.py (path:/tmp/pip-gHsH_e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:04:37 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)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:04:37 INFO - Running setup.py (path:/tmp/pip-68l7cg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:04:37 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:04:37 INFO - Running setup.py (path:/tmp/pip-8c_qo9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:04:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:04:37 INFO - Running setup.py (path:/tmp/pip-eRnNOr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:04:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 06:04:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:04:37 INFO - Running setup.py (path:/tmp/pip-5NTlDy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:04:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 06:04:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:04:38 INFO - Running setup.py (path:/tmp/pip-W1iyYa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:04:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 06:04:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:04:38 INFO - Running setup.py (path:/tmp/pip-DJFsjP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:04:38 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 06:04:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:04:38 INFO - Running setup.py (path:/tmp/pip-i5giDT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:04:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 06:04:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:04:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:04:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 06:04:38 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:04:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:04:38 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:04:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:04:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:04:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:04:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:04:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:04:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:04:40 INFO - Downloading blessings-1.6.tar.gz 06:04:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 06:04:40 INFO - Installing collected packages: blessings 06:04:40 INFO - Running setup.py install for blessings 06:04:40 INFO - Successfully installed blessings 06:04:40 INFO - Cleaning up... 06:04:40 INFO - Return code: 0 06:04:40 INFO - Done creating virtualenv /builds/slave/test/build/venv. 06:04:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:04:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:04:40 INFO - Reading from file tmpfile_stdout 06:04:40 INFO - Current package versions: 06:04:40 INFO - argparse == 1.2.1 06:04:40 INFO - blessings == 1.6 06:04:40 INFO - blobuploader == 1.2.4 06:04:40 INFO - docopt == 0.6.1 06:04:40 INFO - functools32 == 3.2.3-2 06:04:40 INFO - jsonschema == 2.5.1 06:04:40 INFO - manifestparser == 1.1 06:04:40 INFO - mozInstall == 1.12 06:04:40 INFO - mozcrash == 0.17 06:04:40 INFO - mozdebug == 0.1 06:04:40 INFO - mozdevice == 0.48 06:04:40 INFO - mozfile == 1.2 06:04:40 INFO - mozhttpd == 0.7 06:04:40 INFO - mozinfo == 0.9 06:04:40 INFO - mozleak == 0.1 06:04:40 INFO - mozlog == 3.2 06:04:40 INFO - moznetwork == 0.27 06:04:40 INFO - mozprocess == 0.22 06:04:40 INFO - mozprofile == 0.28 06:04:40 INFO - mozrunner == 6.11 06:04:40 INFO - mozscreenshot == 0.1 06:04:40 INFO - mozsystemmonitor == 0.3 06:04:40 INFO - moztest == 0.7 06:04:40 INFO - mozversion == 1.4 06:04:40 INFO - psutil == 3.1.1 06:04:40 INFO - requests == 1.2.3 06:04:40 INFO - wsgiref == 0.1.2 06:04:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:04:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:04:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:04:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:40 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 0x7ff65989ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fb08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x207d020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x210f2e0>, '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 0x207b140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x207b5d0>, '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': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:04:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 06:04:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:04:40 INFO - Using env: {'DISPLAY': ':0', 06:04:40 INFO - 'HOME': '/home/cltbld', 06:04:40 INFO - 'LANG': 'en_US.UTF-8', 06:04:40 INFO - 'LANGUAGE': 'en_US:en', 06:04:40 INFO - 'LOGNAME': 'cltbld', 06:04:40 INFO - 'MAIL': '/var/mail/cltbld', 06:04:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:04:40 INFO - 'MOZ_NO_REMOTE': '1', 06:04:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:04:40 INFO - 'NO_EM_RESTART': '1', 06:04:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:04:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:04:40 INFO - 'PWD': '/builds/slave/test', 06:04:40 INFO - 'SHELL': '/bin/bash', 06:04:40 INFO - 'SHLVL': '1', 06:04:40 INFO - 'TERM': 'linux', 06:04:40 INFO - 'TMOUT': '86400', 06:04:40 INFO - 'USER': 'cltbld', 06:04:40 INFO - 'XDG_SESSION_COOKIE': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 06:04:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:04:40 INFO - '_': '/tools/buildbot/bin/python'} 06:04:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:04:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 06:04:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 06:04:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 06:04:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 06:04:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 06:04:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 06:04:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 06:04:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 06:04:40 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 06:04:40 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 06:04:40 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 06:04:40 INFO - Cleaning up... 06:04:40 INFO - Return code: 0 06:04:40 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 06:04:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:04:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:04:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:04:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:40 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 0x7ff65989ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fb08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x207d020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x210f2e0>, '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 0x207b140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x207b5d0>, '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': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:04:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 06:04:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 06:04:40 INFO - Using env: {'DISPLAY': ':0', 06:04:40 INFO - 'HOME': '/home/cltbld', 06:04:40 INFO - 'LANG': 'en_US.UTF-8', 06:04:40 INFO - 'LANGUAGE': 'en_US:en', 06:04:40 INFO - 'LOGNAME': 'cltbld', 06:04:40 INFO - 'MAIL': '/var/mail/cltbld', 06:04:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:04:40 INFO - 'MOZ_NO_REMOTE': '1', 06:04:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:04:40 INFO - 'NO_EM_RESTART': '1', 06:04:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:04:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:04:40 INFO - 'PWD': '/builds/slave/test', 06:04:40 INFO - 'SHELL': '/bin/bash', 06:04:40 INFO - 'SHLVL': '1', 06:04:40 INFO - 'TERM': 'linux', 06:04:40 INFO - 'TMOUT': '86400', 06:04:40 INFO - 'USER': 'cltbld', 06:04:40 INFO - 'XDG_SESSION_COOKIE': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 06:04:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:04:40 INFO - '_': '/tools/buildbot/bin/python'} 06:04:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:04:41 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 06:04:41 INFO - Cleaning up... 06:04:41 INFO - Return code: 0 06:04:41 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 06:04: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')]} 06:04:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:04:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04: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')]} 06:04:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:04:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:04:41 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 0x7ff65989ff10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fb08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x207d020>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x210f2e0>, '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 0x207b140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x207b5d0>, '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': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:04:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 06:04:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 06:04:41 INFO - Using env: {'DISPLAY': ':0', 06:04:41 INFO - 'HOME': '/home/cltbld', 06:04:41 INFO - 'LANG': 'en_US.UTF-8', 06:04:41 INFO - 'LANGUAGE': 'en_US:en', 06:04:41 INFO - 'LOGNAME': 'cltbld', 06:04:41 INFO - 'MAIL': '/var/mail/cltbld', 06:04:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:04:41 INFO - 'MOZ_NO_REMOTE': '1', 06:04:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:04:41 INFO - 'NO_EM_RESTART': '1', 06:04:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:04:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:04:41 INFO - 'PWD': '/builds/slave/test', 06:04:41 INFO - 'SHELL': '/bin/bash', 06:04:41 INFO - 'SHLVL': '1', 06:04:41 INFO - 'TERM': 'linux', 06:04:41 INFO - 'TMOUT': '86400', 06:04:41 INFO - 'USER': 'cltbld', 06:04:41 INFO - 'XDG_SESSION_COOKIE': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 06:04:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:04:41 INFO - '_': '/tools/buildbot/bin/python'} 06:04:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:04:41 INFO - Downloading/unpacking flake8 06:04:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:04:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:04:41 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:04:41 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:04:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:04:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:04:43 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 06:04:43 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 06:04: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 06:04: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 06:04: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 06:04: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 06:04: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 06:04: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 06:04:43 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 06:04:43 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 06:04: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 06:04: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 06:04: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 06:04: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 06:04: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 06:04: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 06:04:43 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 06:04: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 06:04: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 06:04: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 06:04: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 06:04: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 06:04: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 06:04:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 06:04:43 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 06:04:43 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 06:04:43 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 06:04:43 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 06:04:43 INFO - no previously-included directories found matching 'docs/_build' 06:04:43 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 06:04:43 INFO - Running setup.py install for pep8 06:04:44 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 06:04:44 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 06:04:44 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 06:04:44 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 06:04:44 INFO - no previously-included directories found matching 'docs/_build' 06:04:44 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 06:04:44 INFO - Successfully installed flake8 mccabe pyflakes pep8 06:04:44 INFO - Cleaning up... 06:04:44 INFO - Return code: 0 06:04:44 INFO - Running post-action listener: _resource_record_post_action 06:04:44 INFO - Running post-action listener: _start_resource_monitoring 06:04:44 INFO - Starting resource monitoring. 06:04:44 INFO - ##### 06:04:44 INFO - ##### Finished create-virtualenv step (success) 06:04:44 INFO - ##### 06:04:44 INFO - ##### 06:04:44 INFO - ##### Running install step. 06:04:44 INFO - ##### 06:04:44 INFO - Running pre-action listener: _resource_record_pre_action 06:04:44 INFO - Running main action method: install 06:04:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:04:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:04:44 INFO - Reading from file tmpfile_stdout 06:04:44 INFO - Detecting whether we're running mozinstall >=1.0... 06:04:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 06:04:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 06:04:44 INFO - Reading from file tmpfile_stdout 06:04:44 INFO - Output received: 06:04:44 INFO - Usage: mozinstall [options] installer 06:04:44 INFO - Options: 06:04:44 INFO - -h, --help show this help message and exit 06:04:44 INFO - -d DEST, --destination=DEST 06:04:44 INFO - Directory to install application into. [default: 06:04:44 INFO - "/builds/slave/test"] 06:04:44 INFO - --app=APP Application being installed. [default: firefox] 06:04:44 INFO - mkdir: /builds/slave/test/build/application 06:04:44 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'] 06:04:44 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 06:05:00 INFO - Reading from file tmpfile_stdout 06:05:00 INFO - Output received: 06:05:00 INFO - /builds/slave/test/build/application/firefox/firefox 06:05:00 INFO - Running post-action listener: _resource_record_post_action 06:05:00 INFO - ##### 06:05:00 INFO - ##### Finished install step (success) 06:05:00 INFO - ##### 06:05:00 INFO - ##### 06:05:00 INFO - ##### Running run-tests step. 06:05:00 INFO - ##### 06:05:00 INFO - Running pre-action listener: _resource_record_pre_action 06:05:00 INFO - Running main action method: run_tests 06:05:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 06:05:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 06:05:00 INFO - Python 2.7.3 06:05:00 INFO - Return code: 0 06:05:00 INFO - grabbing minidump binary from tooltool 06:05:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:05:00 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 0x210f2e0>, '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 0x207b140>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x207b5d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 06:05:00 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 06:05:00 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 06:05:00 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 06:05:00 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 06:05:00 INFO - Return code: 0 06:05:00 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 06:05:00 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 06:05:00 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 06:05:00 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 06:05:00 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 06:05:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 06:05:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 06:05:01 INFO - Return code: 0 06:05:01 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/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-055', '--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 06:05:01 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/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-055 --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 06:05:01 INFO - Using env: {'DISPLAY': ':0', 06:05:01 INFO - 'HOME': '/home/cltbld', 06:05:01 INFO - 'LANG': 'en_US.UTF-8', 06:05:01 INFO - 'LANGUAGE': 'en_US:en', 06:05:01 INFO - 'LOGNAME': 'cltbld', 06:05:01 INFO - 'MAIL': '/var/mail/cltbld', 06:05:01 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 06:05:01 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 06:05:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:05:01 INFO - 'MOZ_NO_REMOTE': '1', 06:05:01 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 06:05:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:05:01 INFO - 'NO_EM_RESTART': '1', 06:05:01 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:05:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:05:01 INFO - 'PWD': '/builds/slave/test', 06:05:01 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 06:05:01 INFO - 'SHELL': '/bin/bash', 06:05:01 INFO - 'SHLVL': '1', 06:05:01 INFO - 'TERM': 'linux', 06:05:01 INFO - 'TMOUT': '86400', 06:05:01 INFO - 'USER': 'cltbld', 06:05:01 INFO - 'XDG_SESSION_COOKIE': 'bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183', 06:05:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:05:01 INFO - '_': '/tools/buildbot/bin/python'} 06:05:01 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/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-055', '--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 06:05:01 INFO - mozversion application_buildid: 20160706033324 06:05:01 INFO - mozversion application_changeset: 65cb053a14bcc2279217cbb551d6839e37de0830 06:05:01 INFO - mozversion application_display_name: FirefoxDeveloperEdition 06:05:01 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 06:05:01 INFO - mozversion application_name: Firefox 06:05:01 INFO - mozversion application_remotingname: firefox-dev 06:05:01 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 06:05:01 INFO - mozversion application_vendor: Mozilla 06:05:01 INFO - mozversion application_version: 49.0a2 06:05:01 INFO - mozversion platform_buildid: 20160706033324 06:05:01 INFO - mozversion platform_changeset: 65cb053a14bcc2279217cbb551d6839e37de0830 06:05:01 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 06:05:01 INFO - mozversion platform_version: 49.0a2 06:05:01 INFO - using testdate: 1467810301 06:05:01 INFO - actual date: 1467810301 06:05:01 INFO - starting webserver on 'localhost:53107' 06:05:01 INFO - SUITE-START | Running 2 tests 06:05:01 INFO - TEST-START | dromaeo_css 06:05:01 INFO - operating with platform_type : linux_ 06:05:01 INFO - Initialising browser for dromaeo_css test... 06:05:01 INFO - TEST-INFO | started process 7592 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpXP5pxo/profile http://localhost:53107/getInfo.html) 06:05:05 INFO - PROCESS | 7592 | __metrics Screen width/height:1600/1200 06:05:05 INFO - PROCESS | 7592 | colorDepth:24 06:05:05 INFO - PROCESS | 7592 | Browser inner width/height: 1024/697 06:05:05 INFO - PROCESS | 7592 | __metrics 06:05:06 ERROR - PROCESS | 7592 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2948: TypeError: this.tabs is undefined 06:05:07 INFO - TEST-INFO | 7592: exit 0 06:05:07 INFO - Browser initialized. 06:05:07 INFO - Running cycle 1/1 for dromaeo_css test... 06:05:07 INFO - TEST-INFO | started process 7721 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpXP5pxo/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:05:19 INFO - PROCESS | 7721 | RSS: Main: 155541504 06:05:19 INFO - PROCESS | 7721 | 06:06:08 INFO - PROCESS | 7721 | 1467810368790 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 06:08:16 INFO - PROCESS | 7721 | Cycle 1(1): loaded http://localhost:53107/tests/dromaeo/cssquery-dojo.html (next: http://localhost:53107/tests/dromaeo/cssquery-ext.html) 06:08:17 INFO - PROCESS | 7721 | RSS: Main: 159408128 06:08:17 INFO - PROCESS | 7721 | 06:11:19 INFO - PROCESS | 7721 | Cycle 1(1): loaded http://localhost:53107/tests/dromaeo/cssquery-ext.html (next: http://localhost:53107/tests/dromaeo/cssquery-jquery.html) 06:11:20 INFO - PROCESS | 7721 | RSS: Main: 157192192 06:11:20 INFO - PROCESS | 7721 | 06:14:22 INFO - PROCESS | 7721 | Cycle 1(1): loaded http://localhost:53107/tests/dromaeo/cssquery-jquery.html (next: http://localhost:53107/tests/dromaeo/cssquery-mootools.html) 06:14:22 INFO - PROCESS | 7721 | RSS: Main: 156774400 06:14:22 INFO - PROCESS | 7721 | 06:17:24 INFO - PROCESS | 7721 | Cycle 1(1): loaded http://localhost:53107/tests/dromaeo/cssquery-mootools.html (next: http://localhost:53107/tests/dromaeo/cssquery-prototype.html) 06:17:24 INFO - PROCESS | 7721 | RSS: Main: 156565504 06:17:24 INFO - PROCESS | 7721 | 06:20:27 INFO - PROCESS | 7721 | Cycle 1(1): loaded http://localhost:53107/tests/dromaeo/cssquery-prototype.html (next: http://localhost:53107/tests/dromaeo/cssquery-yui.html) 06:20:27 INFO - PROCESS | 7721 | RSS: Main: 158269440 06:20:27 INFO - PROCESS | 7721 | 06:23:30 INFO - PROCESS | 7721 | Cycle 1(1): loaded http://localhost:53107/tests/dromaeo/cssquery-yui.html (next: http://localhost:53107/tests/dromaeo/cssquery-dojo.html) 06:23:30 INFO - PROCESS | 7721 | RSS: Main: 158633984 06:23:30 INFO - PROCESS | 7721 | 06:23:30 INFO - PROCESS | 7721 | __start_tp_report 06:23:30 INFO - PROCESS | 7721 | _x_x_mozilla_page_load 06:23:30 INFO - PROCESS | 7721 | _x_x_mozilla_page_load_details 06:23:30 INFO - PROCESS | 7721 | |i|pagename|runs| 06:23:30 INFO - PROCESS | 7721 | |0;dojo.html;3320.48532477466;3394.0496660934946;3408.403529382359;3414.21473061196;3430.5025771263167;5574.968630803304;5631.267935168433;5637.802676906309;5641.774329026839;5695.231143795586;5642.0126477866315;5660.745266463009;5693.345265294482;5706.600537962344;5725.312962444513;5111.386633603964;5153.433122356557;5193.091209038422;5213.9478605214035;5235.947640523584;5047.419546752116;5062.2406639004075;5187.066328060948;5260.8158714445;5283.524482796547;5174.094533456649;5196.220566914974;5199.14214154664;5201.817936372227;5255.816046438375;5251.632385733;5259;5260.368755749316;5262.736863156827;5287.68273903567;4928.310036594879;4974.552290293855;4979.8008079676765;5175.508326708957;5179.2749015137915;5403.675779453206;5428.321459817523;5435.83692489226;5443.401225865152;5454.53636440903;5906.143609176645;5924.022536281508;5929.436703513159;5935.851603709899;5958;5690.573207009491;5904.852378690524;5967.880642387128;5977.3723759005115;5978.2228310319815;5563.638363506399;5569.220309156722;5586.52514536269;5596.524295434893;5600.551955843523;6033.939660603425;6034;6047.7278522466595;6053.4854537363935;6061.242344706823;5722.799702010409;5894.616849904743;5911.527077833763;5936.28764548257;6019.909701354483;6078.149059131725;6079;6091.9695401523595;6096.756129754849;6109.84725381869;5809.128630705428;6059.7273122709585;6064.4845188158615;6069;6073.544484163705;5883.14694369314;5932.584719069624;5972.163897054415;6014.488768454643;6020.066889632114;4558.794854231567;4589;4646.326282688991;4648.604868586141;4683.320918466803;4042.6361627453084;4070.7354021988476;4125.97937010313;4153.854615088518;4196.580341965779;5658.773649053992;5717;5767.048437007847;5770.855728606818;5883.794067207627;5995.2206213192;6007.189029481052;6015.157877897098;6015.187949626745;6035.034394496859;5662.886742265214;5755.107958266475;5763.654180749085;5784.652920824764;5785.074388097884;5055.545000949932;5102.464241254689;5112.412072611697;5122.564582010571;5145.45972672864;6325;6371.585846919936;6388.456981156561;6398.648074355955;6409.807705768834;5819.621724587888;5983.222181116601;6046.818595442144;6079.878402432015;6108.297545782292;6327.651979141191;6341.936580634135;6393.7122829471855;6400.39196276353;6411.262704789009;5941.1385349125;6022.337542870193;6025.728842202024;6031.879362412639;6039.154518367344;5786.566007549366;5998.520118390606;6029.246344206974;6106.603070800384;6107.938920610737;5959.0763431668165;5976.731047102804;5978.312494063239;5979.372165922516;5995.280566332068;5894.882102358015;5951.7619295227705;5956.612820166675;5968.16445697594;5977.940220597912;5595.5523558116065;5686.459786320293;5720.971395143164;5757.884842303047;5828.562857785768;5840.795572154954;5883.852903677443;5917.615355001911;5929.0217114175675;5957.046872500379;5591.804286849941;5810.128480727924;5812.099124635688;5815.651060936358;5826.621269617462 06:23:30 INFO - PROCESS | 7721 | |1;ext.html;586.7916889504226;654.7839213059691;658.9341065893408;665.171861033014;672.7981605518345;47548.28677569835;49400.752996235016;49430.752846235715;49446.50553494464;53508;50892.74553627227;51247;51701;51729.48270517294;51793.482065179334;9234.07659234078;9237.769055773591;9336.3464557481;9354.391964522285;9364.578593963288;9263.814723705522;9351.532423378838;9357.719268421959;9359.157675809176;9368.016358282384;9322.254219662445;9327.6735314264;9395.718128456123;9412.623495060223;9430.339876208669;9260.351775375726;9298.302627302946;9302.581383837743;9321.813563728687;9367.76580585484;9106.908930910738;9201.677941272023;9227.215686666641;9247.306452016126;9296.535173241378;47198.76400618009;47436.52563474356;47694;47708;47752;3663.505426767379;3778.924421511582;3921.666658334045;4022.5582672056753;4237.533871274158;35200.471992920124;36054;36325.63674363249;36465.453018204746;36614.8169259152;4391.27543955247;4408.096340250241;4587.885302867422;4694.319323698045;4704.835330763407;379531;382632;383482;384513;384731;69095;70626.29373706198;70986.64506677537;71184.64407677928;71225;40112;40761.59238407637;40963.7951810239;42331.7883410581;42763.57236427658;17917.910410448127;18144.727829082574;18233.817661823476;18258.36095736643;18268.81731182671;13343.06598538093;13355.332233388292;13371.863391611821;13381;13385.93307033478;21947;22166.445838854157;22244.443888902584;22267.55464890693;22370.217042403438;7732.110807257125;7955.164707705723;8002.279794818494;8020.839583208303;8153.673853045931;1056.9577216911237;1114.9275297105662;1147.9081673466103;1180.988190118105;1214.332117335462;33911.830440848134;33943.83028084893;34002.31995360079;34149.31701365959;35164.12089697778;1130.3669944830922;1164.5225457562358;1173.2549830857467;1190.9523619055142;1193.039603119497;18112.91322520653;18120.365787197385;18151.27394904189;18239.088045597666;18249.996250206364;600120;734618;1149557;1165056;1193463;63245.68377158085;63584;64303.67848160729;64501.354986450475;64559;1461.9634509137356;1466.047069404874;1468.7723402872573;1498.1235976953603;1499.6175975126491;33097;33165.668343316254;33213.667863321054;33538;33870.491942621375;56474.717626411606;56746;56749;56885.715571421875;57177;446570;448515;451213;452617;454138;30731.692683072884;31341.68658313479;31499;31508.84245578849;31528;51170.48829511806;51297;51984.74007629938;52046.21930671119;52663;42670;44149.77925110354;44231.115377691625;44684.32973505335;45513.772431138954;42570.57429425666;42841.1431771369;43116.56883431251;43326;44259.55740442554;43613.34579981239;43922.24311027523;44130.55869441393;44714.3292850614;44946.3258051123;36734.265314693024;37461.62538374581;37589.81205093957;38230;38693.806530967166;28831.855840720662;29449;29518.262043448227;29572.704272957857;29666.258343541584 06:23:30 INFO - PROCESS | 7721 | |2;jquery.html;404.4398508066327;413.9399787030879;418.13028899888224;422.2863360920045;439.2159994409977;18918.337858174968;19698.21207151714;20469.590608187827;20480.487987800294;20588.38234852953;19306.420807375765;19357.516062098453;19428;20231.696524552142;20246.69629955552;5735.340435849878;5930.703464826763;5942.346341902387;5950.196723442345;5957.88084238315;5153.871153221162;5820.912686309709;5903.88192236155;6430.614163150202;6460.806175814733;5548.250986116863;6492.610443373413;6508;6509.121268628745;6535.150430444036;5741.081426971686;5880.794172203974;5897.6166549174595;5906.202662640574;5908.409159084079;5034.597232221414;5333.066713325153;5373.650712703662;5419.051665958442;5436.157395603688;13567.796483052762;16485.83514164855;20019.999000050084;23949.401264968514;23958.401039973967;2404.266698656909;2412.8311018228733;2447.375919140608;2472.1594657816427;2555.3228394475477;10528.736781580521;10552.788944221073;10621.946890265577;10710.19673524481;13789.896808255315;2023;2136.42316574524;2137.230596985084;2224.021430570544;2243.551289742058;97373.51313243459;98907;101343.49328253312;102013;104224;18985.33551325697;19120.33078842234;19137;19283.710744338845;19836.404907852786;35295.64704352975;35371.469427958604;35598.46602300968;35603.28793424117;35683.28633427317;10634.20243481742;10917.781644367069;11029.944850275857;11087.22389432732;11113.777724445628;9209.861852072225;9234.722958311262;9255.444673319622;9400.858987115198;9438.858417123749;9490.762730931643;9553.713388598353;9765;9922.503874806374;9974.700758977242;3416.760826742104;3598.874039408608;3749.887503374903;3796.392577187692;3812.653574924588;454.493240037356;469.4272986955908;470.4237309296085;481.64839667043253;958.8513780364054;11772.470238839272;12317.507299707911;12359.196652217577;19359;20935.790642093383;1050.8423736439595;1053.3574519543072;1054.9924821795166;1100.3287994323457;1119.1382635370883;10810.189235807346;11471.483783229774;11481.425928703531;11576.421178941187;11642.35967021805;509882;512308;513753;529361;592902;105820;107334.46332768287;107793.46103269591;108132;108320.45839770751;1094.102835674755;1135.875053744104;1136.3579577538665;1137.5961533655598;1146.3981409759942;17942.282308707505;18015;18202.45392638223;18386.632267354846;18416.81583184151;39580.60419395769;42405.57594424016;43355;44054.55945440505;45530.54469455396;58059;59770.402295976484;61761;65544.67227663832;65895.67052164709;5753.683547404933;7264.818379540342;7820.748680211139;8705.085965973482;8837.204651581389;12952.222866628032;13937.163770173822;14008.579742607739;14187.006909516647;14194.92902535522;12192.085593580694;12276.44755985965;12299.200551964093;12306.81539776922;12671.80992285135;11913.523459061887;11978.76042479128;12034.939825300817;12279.201851879956;12389.690257743629;12180.390980450764;12333.321667308384;12536.561220357244;12827.615171544869;12999.545015924397;7742.341900938258;7749.302562769378;8094.10964793884;8103.432759706764;8244.752657420288;11387.601433949772;11801.940990294994;11874;11884.82172767392;12060.216085954386 06:23:30 INFO - PROCESS | 7721 | |3;mootools.html;1571.2693597477175;1628.4707470072226;1786.0980204996474;1903.6478251523479;1931.758530183727;8439.32485401168;9016.09839016098;9320.440773553575;9610.5675244614;9641.855372169415;9395.248380129591;9599.712008639752;9696.17582505488;9744.756381090476;9781.510924453767;2463.556559819232;2503.7746602805746;2507.3982244261338;2508.5735424977706;2509.0967251789343;2440.5973014452684;2451.656768052474;2454.828162028659;2456.2140115163156;2472.295395812194;2389.0802041214083;2402.243293362585;2417.407735104893;2419.7096348438213;2421.878906054699;2413.3242692046256;2422.4186195313173;2456.8771561421945;2470.258922323296;2472.554940110779;2408.1812183857396;2420.5037967216676;2434.1480481831395;2462.8152888533255;2465.1864884588044;9637.518124093767;9719.17387022104;9720.562574684156;9722.465264410455;9728.75678108046;5547;5713.14302854571;5738.167965645;5786.710664466802;5803.796867109673;3514.8208110971364;3577.9105522362147;3582.3551760683067;3757.511523501955;3758.909916124348;1114.6266000889711;1137.6416428824894;1141.8116010858198;1151.6142092399057;1185.8636256830403;13788.862111378958;13861.099028563212;13875.37560809766;13880.375383107785;13902.860971390359;5048.1418158913075;5050.924236136461;5164.638475306768;5205.427402985669;5237.711925844039;11679.182457227913;11706.88293117075;11743.765124697458;11744.29534227949;11768.823467647991;5704.743286552115;5773.884522309614;5785.971070144622;5792.333881603585;5799.449052340021;4662.300654901724;5257.395399529103;5315.574754019669;5448.128299472065;5451.155070964007;4392.626626736699;4427.468703755506;4442.68901176921;4450.421445212101;4521.480029796549;1357.4095268558012;1383.4742797736997;1388.9722205555831;1403.0185855058003;1406.184413040434;1040.141882946557;1082.220801023262;1085.9022687957963;1091.154355374591;1099.9175061870392;6397.776077837253;6482.546221764525;6583.736650534021;6601.438877695354;6634.0712300278;518.4193703052605;523.8297553295118;524.8897731476357;526.6681990346058;526.94730526947;4450.599446049806;4520.81916723334;4521.186186486464;4523.819047238139;4527.524609915911;10795.190360722978;11223.831642525369;11297.209195356247;11306;11306.660800176009;11226.66320010401;11229.382383968798;11242.213045086766;11279.492422840993;11666;8748.300135989106;9029.548522573845;9167.17495425415;9175.58709858058;9176.541172941326;6786.185657721105;7003.859922801414;7023.438124950094;7050.612216328152;7064;11094.889051109385;11131.05386042163;11353.886461135613;11540.538378464767;11542;11412.144089193509;11443.14176436754;11565.479553419947;11619.767604648028;11655.242409243372;7938.920610793818;8152.429329946846;8346.66613335484;8758.781030474034;8907.465552066897;9584.37701549397;9624;9651.131398174199;9679.08048735369;9701.272404569545;8401.495910245405;8617.612207450555;8705.608247628745;8707.521086340312;8750.737477875675;8158.428909976482;8261.793455163668;8282.83434331298;8314.501129932223;8346.081930987708;7918.485298455582;7937.365010799007;8024.759257222293;8029.51822890605;8037.03555573335;5801;5845.883082338414;5940.762369505172;5997.430244126801;6079.696015199134;5887.58786884931;5894.764209431574;5897.764089436375;6027.969860150672;6052.546059045677 06:23:30 INFO - PROCESS | 7721 | |4;prototype.html;342.6659007467718;346.8040557085247;351.36227746639855;357.3870811558177;360.5349099661437;5611.466910643492;5687.544996400288;5784.68184249866;5889.057750759879;5899.056151015833;5635.464630860072;5678.687672178028;5702.515286200678;5714.857128571777;5723.570732195081;4409.911801763963;4410.801513931865;4417.315316126005;4423.469183697961;4436.645068394537;4356.627662286385;4395.220285324804;4454.153710794954;4459.888502787424;4465.062336909236;4394.560543945612;4403.295472724365;4409.603135717784;4448.065906159711;4455.688101832873;4447.555244475543;4466.240739074333;4469.173202957463;4478;4480.775961201927;3653.9817300913323;3852.210296889131;3957.525096988351;3973.860914867995;3981.6814654827544;5494.752736126884;5500.064988951888;5500.1749737539685;5511.421300763443;5529.364123125852;4939.777710003059;4973.726445045521;5004.324416203803;5016.799328026875;5017.322661440695;5761.654300741927;5945;5974.4921681657115;5976.252968378953;6007.128966299862;4193.5387107418155;4222.387753775716;4239.703220774547;4242.7242229255;4253.553376895412;6217.87564248717;6235.96882015587;6279.591826531261;6312.810615681537;6334.303226645019;4202.348635961431;4356.6514678825615;4430.867073987721;4433.401490798701;4455.75493347869;4485.8112600160985;4496.910061798746;4497.190505708938;4501.414816073955;4508.864734057984;5077.466865979093;5110.207917772751;5121.539061484485;5130.7178105204575;5159.1229490986625;5793.565482588822;5888.234529511136;5973.880522389615;5991.430814072656;6017.18767966319;1542.3213785934377;1555.2845690982049;1563.351209248172;1571.3793051744726;1577.7238983177897;1001.9599216031277;1016.4917541229386;1016.7305663999047;1023.2990401574945;1025.8612939637146;5256.605754568346;5285.418603953562;5290.899552846575;5323.520883120537;5376.596755243294;5474.972625136849;5487.890242195133;5497.862553436116;5506.476884695948;5535.640183388067;4923.556879880828;5244.790208391698;5281.9207711884355;5321.775991521971;5322.733863306819;2894.8999380235377;2935.6623988241627;2983.77621678375;2991.2970451943775;2998.58019877213;5706.25818643582;5778.566607504454;5825.33008703996;5842.182094506772;5891.3814049525035;5829.950608890441;6264.185655864709;6265.8746825063245;6280.9685951569945;6322.936770632235;6442.613443193423;6457;6460.3216662250725;6471.611703297817;6596.67016649156;6039.939600603938;6219.191505104308;6253.593516421418;6266.154069200599;6272.874542509216;6072.878542429038;6142.293636231711;6149.200603921461;6172.382761723792;6222.719977601109;6210.534209934363;6528.118703975093;6556.409923106943;6562.80311590653;6596.80209593713;4263.424437700871;4309.5044069932355;4328.2425575524785;4328.8268469260875;4348.847555397885;5987.221661184019;6028.703828676856;6226.59527130735;6248.343923887926;6307.211598550181;5963.91054134197;5980.282366116094;5987.712641782038;5988.131720900358;5988.520918326611;6055;6071.7571297147615;6071.787487437919;6085.148079268817;6099.603525770811;5705.771769129188;5991.610545314541;5993.310769261417;6014.308354539109;6034.24571928509;6119.653676191231;6130.877382452415;6135.975128207591;6162.599431036968;6207.503399728102;5646.830595082154;5960.314563825215;5997;5998.790042348497;6010.849728756816 06:23:30 INFO - PROCESS | 7721 | |5;yui.html;828.9709860154895;836.4061516323413;859.5616235719783;905.7373361725103;927.9907200927988;15474.38102475901;16767.580810479743;16774.496765097036;16781.077040762753;16848.241829117687;15732.370705171808;15822;15855;15911.920440397782;16041.598960025976;850.808568072185;870.6647940542873;873.10506730601;885.9689910853122;887.5029983209423;888.2716172738325;889.5107690770083;889.5107690770083;889.7419748272993;890.768400215942;918.2103391083663;922.280621115531;925.1442415765424;925.1627277314042;926.8470702334107;911.1935936696038;916.5829547555846;917.7384445433053;917.9770505737343;919.8022425178585;674.3896773420063;676.3743537228045;678.4267294136447;679.0696745458753;680.601847918968;14723.852761472355;14820.851791482055;14833.480828170963;14868.553943381608;14896.329665165094;14367.78448323276;14479.855201447956;14716.484923027643;15093;15223.31495082724;13243.602691919257;13784.448622055106;13808.447662093504;13812.792808107886;13923.860761392358;4721.811127554894;4765.142274390609;4767.61859051275;4822.493638167977;4875.829345972909;79509;80271;80308.59845700793;80311.19688803154;80855;12146.696332591757;12238.571649992207;12339;12348.320842353578;12508.499660013498;21704.56590868174;21706.674399884014;21709.131634734433;21713.56572868534;21719.67420488694;9046.81906361869;9047.140521650434;9107.22588579965;9262.536873156316;9393.107654772786;4990.5508504234795;5009.649324547319;5061.44324124346;5077.619178561623;5268.92096618551;4089.1208390195657;4320.978395108004;4344.044310251739;4352.934705979413;4379.4525684289465;739.593223726948;745.3105877063695;750.6171852355338;751.2337415835817;764.3273918951398;707.989380159298;776.4060493722307;782.1748055801185;798.6246464161951;801.3749275565068;11228.66314010581;11248.550057997752;11290.435478226056;11386.985021060107;11528;691.7993781803322;695.422799076765;736.6500912066725;745.8657441660445;821.5892053973014;5026.611766931683;5161.251618515369;5261.973690131601;5265.921011184835;5320.920186197211;74070;75138.24861751312;108442.45778771213;133929;136608.31695841457;65650.67174664096;104742.47628761808;105595;112898;116615.41692291484;94030.52984735032;94940.52529737307;97310.51344743231;98140.50929745448;99401;9806.264530160124;9958.502074896081;9982.247576495063;10016;10094.495275236355;56450.43549564452;57480;58144.709276453345;58320.70839645775;59349.703251483465;72156;86957.56521217353;87394.56302718446;88615;90097.09902900887;13018.414171362501;13095.41070651842;13293.401796918968;13412.750060854081;13468.5286014989;15395.307211175748;15429.151396672842;15618.609534761268;15933.840661593236;16149.19254037317;14376.712465750417;14699.191544465157;14906.627334316729;15217.695646087237;15335.846641533888;14705.852941470876;14943.77584336214;14963.700725985202;14982.625434364229;15306.693866122838;14613.853861461675;14825.703485930437;14884.702305953604;14979.625509362353;15655.530334089995;12236.938815305866;12468.127231094099;12515.749685006067;12615.87384126147;12719.109662323548;12151.513939442324;12173.69565760863;12398.380080996094;12489.437975291316;12575.245485270912 06:23:30 INFO - PROCESS | 7721 | __end_tp_report 06:23:30 INFO - PROCESS | 7721 | __start_cc_report 06:23:30 INFO - PROCESS | 7721 | _x_x_mozilla_cycle_collect,337 06:23:30 INFO - PROCESS | 7721 | __end_cc_report 06:23:30 INFO - PROCESS | 7721 | __startTimestamp1467811410553__endTimestamp 06:23:30 INFO - PROCESS | 7721 | 06:23:30 INFO - PROCESS | 7721 | ------- Summary: start ------- 06:23:30 INFO - PROCESS | 7721 | Number of tests: 6 06:23:30 INFO - PROCESS | 7721 | 06:23:30 INFO - PROCESS | 7721 | [#0] dojo.html Cycles:165 Average:5603.72 Median:5809.13 stddev:622.61 (10.7%) stddev-sans-first:598.20 06:23:30 INFO - PROCESS | 7721 | Values: 3320.5 3394.0 3408.4 3414.2 3430.5 5575.0 5631.3 5637.8 5641.8 5695.2 5642.0 5660.7 5693.3 5706.6 5725.3 5111.4 5153.4 5193.1 5213.9 5235.9 5047.4 5062.2 5187.1 5260.8 5283.5 5174.1 5196.2 5199.1 5201.8 5255.8 5251.6 5259.0 5260.4 5262.7 5287.7 4928.3 4974.6 4979.8 5175.5 5179.3 5403.7 5428.3 5435.8 5443.4 5454.5 5906.1 5924.0 5929.4 5935.9 5958.0 5690.6 5904.9 5967.9 5977.4 5978.2 5563.6 5569.2 5586.5 5596.5 5600.6 6033.9 6034.0 6047.7 6053.5 6061.2 5722.8 5894.6 5911.5 5936.3 6019.9 6078.1 6079.0 6092.0 6096.8 6109.8 5809.1 6059.7 6064.5 6069.0 6073.5 5883.1 5932.6 5972.2 6014.5 6020.1 4558.8 4589.0 4646.3 4648.6 4683.3 4042.6 4070.7 4126.0 4153.9 4196.6 5658.8 5717.0 5767.0 5770.9 5883.8 5995.2 6007.2 6015.2 6015.2 6035.0 5662.9 5755.1 5763.7 5784.7 5785.1 5055.5 5102.5 5112.4 5122.6 5145.5 6325.0 6371.6 6388.5 6398.6 6409.8 5819.6 5983.2 6046.8 6079.9 6108.3 6327.7 6341.9 6393.7 6400.4 6411.3 5941.1 6022.3 6025.7 6031.9 6039.2 5786.6 5998.5 6029.2 6106.6 6107.9 5959.1 5976.7 5978.3 5979.4 5995.3 5894.9 5951.8 5956.6 5968.2 5977.9 5595.6 5686.5 5721.0 5757.9 5828.6 5840.8 5883.9 5917.6 5929.0 5957.0 5591.8 5810.1 5812.1 5815.7 5826.6 06:23:30 INFO - PROCESS | 7721 | 06:23:30 INFO - PROCESS | 7721 | [#1] ext.html Cycles:180 Average:75251.09 Median:24165.17 stddev:181944.35 (752.9%) stddev-sans-first:182368.39 06:23:30 INFO - PROCESS | 7721 | Values: 586.8 654.8 658.9 665.2 672.8 47548.3 49400.8 49430.8 49446.5 53508.0 50892.7 51247.0 51701.0 51729.5 51793.5 9234.1 9237.8 9336.3 9354.4 9364.6 9263.8 9351.5 9357.7 9359.2 9368.0 9322.3 9327.7 9395.7 9412.6 9430.3 9260.4 9298.3 9302.6 9321.8 9367.8 9106.9 9201.7 9227.2 9247.3 9296.5 47198.8 47436.5 47694.0 47708.0 47752.0 3663.5 3778.9 3921.7 4022.6 4237.5 35200.5 36054.0 36325.6 36465.5 36614.8 4391.3 4408.1 4587.9 4694.3 4704.8 379531.0 382632.0 383482.0 384513.0 384731.0 69095.0 70626.3 70986.6 71184.6 71225.0 40112.0 40761.6 40963.8 42331.8 42763.6 17917.9 18144.7 18233.8 18258.4 18268.8 13343.1 13355.3 13371.9 13381.0 13385.9 21947.0 22166.4 22244.4 22267.6 22370.2 7732.1 7955.2 8002.3 8020.8 8153.7 1057.0 1114.9 1147.9 1181.0 1214.3 33911.8 33943.8 34002.3 34149.3 35164.1 1130.4 1164.5 1173.3 1191.0 1193.0 18112.9 18120.4 18151.3 18239.1 18250.0 600120.0 734618.0 1149557.0 1165056.0 1193463.0 63245.7 63584.0 64303.7 64501.4 64559.0 1462.0 1466.0 1468.8 1498.1 1499.6 33097.0 33165.7 33213.7 33538.0 33870.5 56474.7 56746.0 56749.0 56885.7 57177.0 446570.0 448515.0 451213.0 452617.0 454138.0 30731.7 31341.7 31499.0 31508.8 31528.0 51170.5 51297.0 51984.7 52046.2 52663.0 42670.0 44149.8 44231.1 44684.3 45513.8 42570.6 42841.1 43116.6 43326.0 44259.6 43613.3 43922.2 44130.6 44714.3 44946.3 36734.3 37461.6 37589.8 38230.0 38693.8 28831.9 29449.0 29518.3 29572.7 29666.3 06:23:30 INFO - PROCESS | 7721 | 06:23:30 INFO - PROCESS | 7721 | [#2] jquery.html Cycles:180 Average:32349.97 Median:13096.48 stddev:88196.80 (673.4%) stddev-sans-first:88411.60 06:23:30 INFO - PROCESS | 7721 | Values: 404.4 413.9 418.1 422.3 439.2 18918.3 19698.2 20469.6 20480.5 20588.4 19306.4 19357.5 19428.0 20231.7 20246.7 5735.3 5930.7 5942.3 5950.2 5957.9 5153.9 5820.9 5903.9 6430.6 6460.8 5548.3 6492.6 6508.0 6509.1 6535.2 5741.1 5880.8 5897.6 5906.2 5908.4 5034.6 5333.1 5373.7 5419.1 5436.2 13567.8 16485.8 20020.0 23949.4 23958.4 2404.3 2412.8 2447.4 2472.2 2555.3 10528.7 10552.8 10621.9 10710.2 13789.9 2023.0 2136.4 2137.2 2224.0 2243.6 97373.5 98907.0 101343.5 102013.0 104224.0 18985.3 19120.3 19137.0 19283.7 19836.4 35295.6 35371.5 35598.5 35603.3 35683.3 10634.2 10917.8 11029.9 11087.2 11113.8 9209.9 9234.7 9255.4 9400.9 9438.9 9490.8 9553.7 9765.0 9922.5 9974.7 3416.8 3598.9 3749.9 3796.4 3812.7 454.5 469.4 470.4 481.6 958.9 11772.5 12317.5 12359.2 19359.0 20935.8 1050.8 1053.4 1055.0 1100.3 1119.1 10810.2 11471.5 11481.4 11576.4 11642.4 509882.0 512308.0 513753.0 529361.0 592902.0 105820.0 107334.5 107793.5 108132.0 108320.5 1094.1 1135.9 1136.4 1137.6 1146.4 17942.3 18015.0 18202.5 18386.6 18416.8 39580.6 42405.6 43355.0 44054.6 45530.5 58059.0 59770.4 61761.0 65544.7 65895.7 5753.7 7264.8 7820.7 8705.1 8837.2 12952.2 13937.2 14008.6 14187.0 14194.9 12192.1 12276.4 12299.2 12306.8 12671.8 11913.5 11978.8 12034.9 12279.2 12389.7 12180.4 12333.3 12536.6 12827.6 12999.5 7742.3 7749.3 8094.1 8103.4 8244.8 11387.6 11801.9 11874.0 11884.8 12060.2 06:23:30 INFO - PROCESS | 7721 | 06:23:30 INFO - PROCESS | 7721 | [#3] mootools.html Cycles:180 Average:6376.99 Median:4855.22 stddev:3659.48 (75.4%) stddev-sans-first:3651.93 06:23:30 INFO - PROCESS | 7721 | Values: 1571.3 1628.5 1786.1 1903.6 1931.8 8439.3 9016.1 9320.4 9610.6 9641.9 9395.2 9599.7 9696.2 9744.8 9781.5 2463.6 2503.8 2507.4 2508.6 2509.1 2440.6 2451.7 2454.8 2456.2 2472.3 2389.1 2402.2 2417.4 2419.7 2421.9 2413.3 2422.4 2456.9 2470.3 2472.6 2408.2 2420.5 2434.1 2462.8 2465.2 9637.5 9719.2 9720.6 9722.5 9728.8 5547.0 5713.1 5738.2 5786.7 5803.8 3514.8 3577.9 3582.4 3757.5 3758.9 1114.6 1137.6 1141.8 1151.6 1185.9 13788.9 13861.1 13875.4 13880.4 13902.9 5048.1 5050.9 5164.6 5205.4 5237.7 11679.2 11706.9 11743.8 11744.3 11768.8 5704.7 5773.9 5786.0 5792.3 5799.4 4662.3 5257.4 5315.6 5448.1 5451.2 4392.6 4427.5 4442.7 4450.4 4521.5 1357.4 1383.5 1389.0 1403.0 1406.2 1040.1 1082.2 1085.9 1091.2 1099.9 6397.8 6482.5 6583.7 6601.4 6634.1 518.4 523.8 524.9 526.7 526.9 4450.6 4520.8 4521.2 4523.8 4527.5 10795.2 11223.8 11297.2 11306.0 11306.7 11226.7 11229.4 11242.2 11279.5 11666.0 8748.3 9029.5 9167.2 9175.6 9176.5 6786.2 7003.9 7023.4 7050.6 7064.0 11094.9 11131.1 11353.9 11540.5 11542.0 11412.1 11443.1 11565.5 11619.8 11655.2 7938.9 8152.4 8346.7 8758.8 8907.5 9584.4 9624.0 9651.1 9679.1 9701.3 8401.5 8617.6 8705.6 8707.5 8750.7 8158.4 8261.8 8282.8 8314.5 8346.1 7918.5 7937.4 8024.8 8029.5 8037.0 5801.0 5845.9 5940.8 5997.4 6079.7 5887.6 5894.8 5897.8 6028.0 6052.5 06:23:30 INFO - PROCESS | 7721 | 06:23:30 INFO - PROCESS | 7721 | [#4] prototype.html Cycles:180 Average:4993.41 Median:5503.33 stddev:1483.98 (27.0%) stddev-sans-first:1446.51 06:23:30 INFO - PROCESS | 7721 | Values: 342.7 346.8 351.4 357.4 360.5 5611.5 5687.5 5784.7 5889.1 5899.1 5635.5 5678.7 5702.5 5714.9 5723.6 4409.9 4410.8 4417.3 4423.5 4436.6 4356.6 4395.2 4454.2 4459.9 4465.1 4394.6 4403.3 4409.6 4448.1 4455.7 4447.6 4466.2 4469.2 4478.0 4480.8 3654.0 3852.2 3957.5 3973.9 3981.7 5494.8 5500.1 5500.2 5511.4 5529.4 4939.8 4973.7 5004.3 5016.8 5017.3 5761.7 5945.0 5974.5 5976.3 6007.1 4193.5 4222.4 4239.7 4242.7 4253.6 6217.9 6236.0 6279.6 6312.8 6334.3 4202.3 4356.7 4430.9 4433.4 4455.8 4485.8 4496.9 4497.2 4501.4 4508.9 5077.5 5110.2 5121.5 5130.7 5159.1 5793.6 5888.2 5973.9 5991.4 6017.2 1542.3 1555.3 1563.4 1571.4 1577.7 1002.0 1016.5 1016.7 1023.3 1025.9 5256.6 5285.4 5290.9 5323.5 5376.6 5475.0 5487.9 5497.9 5506.5 5535.6 4923.6 5244.8 5281.9 5321.8 5322.7 2894.9 2935.7 2983.8 2991.3 2998.6 5706.3 5778.6 5825.3 5842.2 5891.4 5830.0 6264.2 6265.9 6281.0 6322.9 6442.6 6457.0 6460.3 6471.6 6596.7 6039.9 6219.2 6253.6 6266.2 6272.9 6072.9 6142.3 6149.2 6172.4 6222.7 6210.5 6528.1 6556.4 6562.8 6596.8 4263.4 4309.5 4328.2 4328.8 4348.8 5987.2 6028.7 6226.6 6248.3 6307.2 5963.9 5980.3 5987.7 5988.1 5988.5 6055.0 6071.8 6071.8 6085.1 6099.6 5705.8 5991.6 5993.3 6014.3 6034.2 6119.7 6130.9 6136.0 6162.6 6207.5 5646.8 5960.3 5997.0 5998.8 6010.8 06:23:30 INFO - PROCESS | 7721 | 06:23:30 INFO - PROCESS | 7721 | [#5] yui.html Cycles:180 Average:22013.25 Median:4766.38 stddev:31286.03 (656.4%) stddev-sans-first:31333.36 06:23:30 INFO - PROCESS | 7721 | Values: 829.0 836.4 859.6 905.7 928.0 15474.4 16767.6 16774.5 16781.1 16848.2 15732.4 15822.0 15855.0 15911.9 16041.6 850.8 870.7 873.1 886.0 887.5 888.3 889.5 889.5 889.7 890.8 918.2 922.3 925.1 925.2 926.8 911.2 916.6 917.7 918.0 919.8 674.4 676.4 678.4 679.1 680.6 14723.9 14820.9 14833.5 14868.6 14896.3 14367.8 14479.9 14716.5 15093.0 15223.3 13243.6 13784.4 13808.4 13812.8 13923.9 4721.8 4765.1 4767.6 4822.5 4875.8 79509.0 80271.0 80308.6 80311.2 80855.0 12146.7 12238.6 12339.0 12348.3 12508.5 21704.6 21706.7 21709.1 21713.6 21719.7 9046.8 9047.1 9107.2 9262.5 9393.1 4990.6 5009.6 5061.4 5077.6 5268.9 4089.1 4321.0 4344.0 4352.9 4379.5 739.6 745.3 750.6 751.2 764.3 708.0 776.4 782.2 798.6 801.4 11228.7 11248.6 11290.4 11387.0 11528.0 691.8 695.4 736.7 745.9 821.6 5026.6 5161.3 5262.0 5265.9 5320.9 74070.0 75138.2 108442.5 133929.0 136608.3 65650.7 104742.5 105595.0 112898.0 116615.4 94030.5 94940.5 97310.5 98140.5 99401.0 9806.3 9958.5 9982.2 10016.0 10094.5 56450.4 57480.0 58144.7 58320.7 59349.7 72156.0 86957.6 87394.6 88615.0 90097.1 13018.4 13095.4 13293.4 13412.8 13468.5 15395.3 15429.2 15618.6 15933.8 16149.2 14376.7 14699.2 14906.6 15217.7 15335.8 14705.9 14943.8 14963.7 14982.6 15306.7 14613.9 14825.7 14884.7 14979.6 15655.5 12236.9 12468.1 12515.7 12615.9 12719.1 12151.5 12173.7 12398.4 12489.4 12575.2 06:23:30 INFO - PROCESS | 7721 | -------- Summary: end -------- 06:23:30 INFO - PROCESS | 7721 | 06:23:31 INFO - TEST-INFO | 7721: exit 0 06:23:31 INFO - TEST-OK | dromaeo_css | took 1109729ms 06:23:31 INFO - TEST-START | kraken 06:23:31 INFO - operating with platform_type : linux_ 06:23:31 INFO - Initialising browser for kraken test... 06:23:31 INFO - TEST-INFO | started process 7970 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWfrve7/profile http://localhost:53107/getInfo.html) 06:23:35 INFO - PROCESS | 7970 | __metrics Screen width/height:1600/1200 06:23:35 INFO - PROCESS | 7970 | colorDepth:24 06:23:35 INFO - PROCESS | 7970 | Browser inner width/height: 1024/697 06:23:35 INFO - PROCESS | 7970 | __metrics 06:23:36 ERROR - PROCESS | 7970 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2948: TypeError: this.tabs is undefined 06:23:37 INFO - TEST-INFO | 7970: exit 0 06:23:37 INFO - Browser initialized. 06:23:37 INFO - Running cycle 1/1 for kraken test... 06:23:37 INFO - TEST-INFO | started process 8099 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWfrve7/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:23:48 INFO - PROCESS | 8099 | RSS: Main: 155516928 06:23:48 INFO - PROCESS | 8099 | 06:23:51 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:53107/tests/kraken/driver.html?testName=audio-beat-detection) 06:23:52 INFO - PROCESS | 8099 | RSS: Main: 160706560 06:23:52 INFO - PROCESS | 8099 | 06:23:54 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:53107/tests/kraken/driver.html?testName=audio-dft) 06:23:55 INFO - PROCESS | 8099 | RSS: Main: 160235520 06:23:55 INFO - PROCESS | 8099 | 06:23:58 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:53107/tests/kraken/driver.html?testName=audio-fft) 06:23:59 INFO - PROCESS | 8099 | RSS: Main: 161017856 06:23:59 INFO - PROCESS | 8099 | 06:24:01 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:53107/tests/kraken/driver.html?testName=audio-oscillator) 06:24:01 INFO - PROCESS | 8099 | RSS: Main: 160825344 06:24:01 INFO - PROCESS | 8099 | 06:24:03 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:53107/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:24:04 INFO - PROCESS | 8099 | RSS: Main: 160579584 06:24:04 INFO - PROCESS | 8099 | 06:24:07 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:53107/tests/kraken/driver.html?testName=imaging-darkroom) 06:24:08 INFO - PROCESS | 8099 | RSS: Main: 161423360 06:24:08 INFO - PROCESS | 8099 | 06:24:11 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:53107/tests/kraken/driver.html?testName=imaging-desaturate) 06:24:12 INFO - PROCESS | 8099 | RSS: Main: 161030144 06:24:12 INFO - PROCESS | 8099 | 06:24:15 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:53107/tests/kraken/driver.html?testName=json-parse-financial) 06:24:15 INFO - PROCESS | 8099 | RSS: Main: 160673792 06:24:15 INFO - PROCESS | 8099 | 06:24:17 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:53107/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:24:17 INFO - PROCESS | 8099 | RSS: Main: 160759808 06:24:17 INFO - PROCESS | 8099 | 06:24:19 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:53107/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:24:20 INFO - PROCESS | 8099 | RSS: Main: 160436224 06:24:20 INFO - PROCESS | 8099 | 06:24:22 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:53107/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:24:23 INFO - PROCESS | 8099 | RSS: Main: 161320960 06:24:23 INFO - PROCESS | 8099 | 06:24:25 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:53107/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:24:26 INFO - PROCESS | 8099 | RSS: Main: 161398784 06:24:26 INFO - PROCESS | 8099 | 06:24:28 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:53107/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:24:29 INFO - PROCESS | 8099 | RSS: Main: 161251328 06:24:29 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | Cycle 1(1): loaded http://localhost:53107/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:53107/tests/kraken/driver.html?testName=ai-astar) 06:24:31 INFO - PROCESS | 8099 | RSS: Main: 161816576 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | __start_tp_report 06:24:31 INFO - PROCESS | 8099 | _x_x_mozilla_page_load 06:24:31 INFO - PROCESS | 8099 | _x_x_mozilla_page_load_details 06:24:31 INFO - PROCESS | 8099 | |i|pagename|runs| 06:24:31 INFO - PROCESS | 8099 | |0;ai-astar;112;106;112;110;113;111;111;110;110;111 06:24:31 INFO - PROCESS | 8099 | |1;audio-beat-detection;158;128;171;184;133;159;150;132;176;127 06:24:31 INFO - PROCESS | 8099 | |2;audio-dft;162;163;162;170;161;167;162;163;164;164 06:24:31 INFO - PROCESS | 8099 | |3;audio-fft;79;76;78;194;74;76;76;75;186;74 06:24:31 INFO - PROCESS | 8099 | |4;audio-oscillator;85;83;147;84;91;85;142;84;84;152 06:24:31 INFO - PROCESS | 8099 | |5;imaging-gaussian-blur;117;117;117;117;117;117;117;117;117;117 06:24:31 INFO - PROCESS | 8099 | |6;imaging-darkroom;147;147;146;147;149;146;146;146;147;146 06:24:31 INFO - PROCESS | 8099 | |7;imaging-desaturate;95;96;96;96;98;96;95;96;95;95 06:24:31 INFO - PROCESS | 8099 | |8;json-parse-financial;53;55;54;53;56;52;52;52;53;54 06:24:31 INFO - PROCESS | 8099 | |9;json-stringify-tinderbox;59;59;58;59;61;60;60;60;61;65 06:24:31 INFO - PROCESS | 8099 | |10;stanford-crypto-aes;77;76;75;78;80;82;77;80;103;77 06:24:31 INFO - PROCESS | 8099 | |11;stanford-crypto-ccm;134;125;126;116;117;120;132;125;128;122 06:24:31 INFO - PROCESS | 8099 | |12;stanford-crypto-pbkdf2;154;157;154;153;152;153;154;160;158;152 06:24:31 INFO - PROCESS | 8099 | |13;stanford-crypto-sha256-iterative;63;61;61;62;61;59;61;60;59;62 06:24:31 INFO - PROCESS | 8099 | __end_tp_report 06:24:31 INFO - PROCESS | 8099 | __start_cc_report 06:24:31 INFO - PROCESS | 8099 | _x_x_mozilla_cycle_collect,887 06:24:31 INFO - PROCESS | 8099 | __end_cc_report 06:24:31 INFO - PROCESS | 8099 | __startTimestamp1467811471304__endTimestamp 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | ------- Summary: start ------- 06:24:31 INFO - PROCESS | 8099 | Number of tests: 14 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#0] ai-astar Cycles:10 Average:110.60 Median:111.00 stddev:1.90 (1.7%) stddev-sans-first:1.94 06:24:31 INFO - PROCESS | 8099 | Values: 112.0 106.0 112.0 110.0 113.0 111.0 111.0 110.0 110.0 111.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#1] audio-beat-detection Cycles:10 Average:151.80 Median:158.50 stddev:21.11 (13.3%) stddev-sans-first:22.27 06:24:31 INFO - PROCESS | 8099 | Values: 158.0 128.0 171.0 184.0 133.0 159.0 150.0 132.0 176.0 127.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#2] audio-dft Cycles:10 Average:163.80 Median:163.50 stddev:2.74 (1.7%) stddev-sans-first:2.83 06:24:31 INFO - PROCESS | 8099 | Values: 162.0 163.0 162.0 170.0 161.0 167.0 162.0 163.0 164.0 164.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#3] audio-fft Cycles:10 Average:98.80 Median:76.00 stddev:48.13 (63.3%) stddev-sans-first:50.51 06:24:31 INFO - PROCESS | 8099 | Values: 79.0 76.0 78.0 194.0 74.0 76.0 76.0 75.0 186.0 74.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#4] audio-oscillator Cycles:10 Average:103.70 Median:84.00 stddev:30.05 (35.8%) stddev-sans-first:31.10 06:24:31 INFO - PROCESS | 8099 | Values: 85.0 83.0 147.0 84.0 91.0 85.0 142.0 84.0 84.0 152.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#5] imaging-gaussian-blur Cycles:10 Average:117.00 Median:117.00 stddev:0.00 (0.0%) stddev-sans-first:0.00 06:24:31 INFO - PROCESS | 8099 | Values: 117.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#6] imaging-darkroom Cycles:10 Average:146.70 Median:147.00 stddev:0.95 (0.6%) stddev-sans-first:1.00 06:24:31 INFO - PROCESS | 8099 | Values: 147.0 147.0 146.0 147.0 149.0 146.0 146.0 146.0 147.0 146.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:96.00 stddev:0.92 (1.0%) stddev-sans-first:0.93 06:24:31 INFO - PROCESS | 8099 | Values: 95.0 96.0 96.0 96.0 98.0 96.0 95.0 96.0 95.0 95.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#8] json-parse-financial Cycles:10 Average:53.40 Median:53.50 stddev:1.35 (2.5%) stddev-sans-first:1.42 06:24:31 INFO - PROCESS | 8099 | Values: 53.0 55.0 54.0 53.0 56.0 52.0 52.0 52.0 53.0 54.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#9] json-stringify-tinderbox Cycles:10 Average:60.20 Median:60.00 stddev:1.93 (3.2%) stddev-sans-first:2.00 06:24:31 INFO - PROCESS | 8099 | Values: 59.0 59.0 58.0 59.0 61.0 60.0 60.0 60.0 61.0 65.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#10] stanford-crypto-aes Cycles:10 Average:80.50 Median:77.50 stddev:8.18 (10.6%) stddev-sans-first:8.58 06:24:31 INFO - PROCESS | 8099 | Values: 77.0 76.0 75.0 78.0 80.0 82.0 77.0 80.0 103.0 77.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#11] stanford-crypto-ccm Cycles:10 Average:124.50 Median:125.50 stddev:5.93 (4.7%) stddev-sans-first:5.20 06:24:31 INFO - PROCESS | 8099 | Values: 134.0 125.0 126.0 116.0 117.0 120.0 132.0 125.0 128.0 122.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:154.70 Median:154.00 stddev:2.71 (1.8%) stddev-sans-first:2.86 06:24:31 INFO - PROCESS | 8099 | Values: 154.0 157.0 154.0 153.0 152.0 153.0 154.0 160.0 158.0 152.0 06:24:31 INFO - PROCESS | 8099 | 06:24:31 INFO - PROCESS | 8099 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:60.90 Median:61.00 stddev:1.29 (2.1%) stddev-sans-first:1.12 06:24:31 INFO - PROCESS | 8099 | Values: 63.0 61.0 61.0 62.0 61.0 59.0 61.0 60.0 59.0 62.0 06:24:31 INFO - PROCESS | 8099 | -------- Summary: end -------- 06:24:31 INFO - PROCESS | 8099 | 06:24:32 INFO - TEST-INFO | 8099: exit 0 06:24:32 INFO - TEST-OK | kraken | took 60946ms 06:24:32 INFO - SUITE-END | took 1170s 06:24:32 INFO - Completed test suite (00:19:30) 06:24:32 INFO - javascript benchmark 06:24:32 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7833.38633375784, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3320.48532477466, 3394.0496660934946, 3408.403529382359, 3414.21473061196, 3430.5025771263167, 5574.968630803304, 5631.267935168433, 5637.802676906309, 5641.774329026839, 5695.231143795586, 5642.0126477866315, 5660.745266463009, 5693.345265294482, 5706.600537962344, 5725.312962444513, 5111.386633603964, 5153.433122356557, 5193.091209038422, 5213.9478605214035, 5235.947640523584, 5047.419546752116, 5062.2406639004075, 5187.066328060948, 5260.8158714445, 5283.524482796547, 5174.094533456649, 5196.220566914974, 5199.14214154664, 5201.817936372227, 5255.816046438375, 5251.632385733, 5259.0, 5260.368755749316, 5262.736863156827, 5287.68273903567, 4928.310036594879, 4974.552290293855, 4979.8008079676765, 5175.508326708957, 5179.2749015137915, 5403.675779453206, 5428.321459817523, 5435.83692489226, 5443.401225865152, 5454.53636440903, 5906.143609176645, 5924.022536281508, 5929.436703513159, 5935.851603709899, 5958.0, 5690.573207009491, 5904.852378690524, 5967.880642387128, 5977.3723759005115, 5978.2228310319815, 5563.638363506399, 5569.220309156722, 5586.52514536269, 5596.524295434893, 5600.551955843523, 6033.939660603425, 6034.0, 6047.7278522466595, 6053.4854537363935, 6061.242344706823, 5722.799702010409, 5894.616849904743, 5911.527077833763, 5936.28764548257, 6019.909701354483, 6078.149059131725, 6079.0, 6091.9695401523595, 6096.756129754849, 6109.84725381869, 5809.128630705428, 6059.7273122709585, 6064.4845188158615, 6069.0, 6073.544484163705, 5883.14694369314, 5932.584719069624, 5972.163897054415, 6014.488768454643, 6020.066889632114, 4558.794854231567, 4589.0, 4646.326282688991, 4648.604868586141, 4683.320918466803, 4042.6361627453084, 4070.7354021988476, 4125.97937010313, 4153.854615088518, 4196.580341965779, 5658.773649053992, 5717.0, 5767.048437007847, 5770.855728606818, 5883.794067207627, 5995.2206213192, 6007.189029481052, 6015.157877897098, 6015.187949626745, 6035.034394496859, 5662.886742265214, 5755.107958266475, 5763.654180749085, 5784.652920824764, 5785.074388097884, 5055.545000949932, 5102.464241254689, 5112.412072611697, 5122.564582010571, 5145.45972672864, 6325.0, 6371.585846919936, 6388.456981156561, 6398.648074355955, 6409.807705768834, 5819.621724587888, 5983.222181116601, 6046.818595442144, 6079.878402432015, 6108.297545782292, 6327.651979141191, 6341.936580634135, 6393.7122829471855, 6400.39196276353, 6411.262704789009, 5941.1385349125, 6022.337542870193, 6025.728842202024, 6031.879362412639, 6039.154518367344, 5786.566007549366, 5998.520118390606, 6029.246344206974, 6106.603070800384, 6107.938920610737, 5959.0763431668165, 5976.731047102804, 5978.312494063239, 5979.372165922516, 5995.280566332068, 5894.882102358015, 5951.7619295227705, 5956.612820166675, 5968.16445697594, 5977.940220597912, 5595.5523558116065, 5686.459786320293, 5720.971395143164, 5757.884842303047, 5828.562857785768, 5840.795572154954, 5883.852903677443, 5917.615355001911, 5929.0217114175675, 5957.046872500379, 5591.804286849941, 5810.128480727924, 5812.099124635688, 5815.651060936358, 5826.621269617462], "value": 5563.497198495225, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [586.7916889504226, 654.7839213059691, 658.9341065893408, 665.171861033014, 672.7981605518345, 47548.28677569835, 49400.752996235016, 49430.752846235715, 49446.50553494464, 53508.0, 50892.74553627227, 51247.0, 51701.0, 51729.48270517294, 51793.482065179334, 9234.07659234078, 9237.769055773591, 9336.3464557481, 9354.391964522285, 9364.578593963288, 9263.814723705522, 9351.532423378838, 9357.719268421959, 9359.157675809176, 9368.016358282384, 9322.254219662445, 9327.6735314264, 9395.718128456123, 9412.623495060223, 9430.339876208669, 9260.351775375726, 9298.302627302946, 9302.581383837743, 9321.813563728687, 9367.76580585484, 9106.908930910738, 9201.677941272023, 9227.215686666641, 9247.306452016126, 9296.535173241378, 47198.76400618009, 47436.52563474356, 47694.0, 47708.0, 47752.0, 3663.505426767379, 3778.924421511582, 3921.666658334045, 4022.5582672056753, 4237.533871274158, 35200.471992920124, 36054.0, 36325.63674363249, 36465.453018204746, 36614.8169259152, 4391.27543955247, 4408.096340250241, 4587.885302867422, 4694.319323698045, 4704.835330763407, 379531.0, 382632.0, 383482.0, 384513.0, 384731.0, 69095.0, 70626.29373706198, 70986.64506677537, 71184.64407677928, 71225.0, 40112.0, 40761.59238407637, 40963.7951810239, 42331.7883410581, 42763.57236427658, 17917.910410448127, 18144.727829082574, 18233.817661823476, 18258.36095736643, 18268.81731182671, 13343.06598538093, 13355.332233388292, 13371.863391611821, 13381.0, 13385.93307033478, 21947.0, 22166.445838854157, 22244.443888902584, 22267.55464890693, 22370.217042403438, 7732.110807257125, 7955.164707705723, 8002.279794818494, 8020.839583208303, 8153.673853045931, 1056.9577216911237, 1114.9275297105662, 1147.9081673466103, 1180.988190118105, 1214.332117335462, 33911.830440848134, 33943.83028084893, 34002.31995360079, 34149.31701365959, 35164.12089697778, 1130.3669944830922, 1164.5225457562358, 1173.2549830857467, 1190.9523619055142, 1193.039603119497, 18112.91322520653, 18120.365787197385, 18151.27394904189, 18239.088045597666, 18249.996250206364, 600120.0, 734618.0, 1149557.0, 1165056.0, 1193463.0, 63245.68377158085, 63584.0, 64303.67848160729, 64501.354986450475, 64559.0, 1461.9634509137356, 1466.047069404874, 1468.7723402872573, 1498.1235976953603, 1499.6175975126491, 33097.0, 33165.668343316254, 33213.667863321054, 33538.0, 33870.491942621375, 56474.717626411606, 56746.0, 56749.0, 56885.715571421875, 57177.0, 446570.0, 448515.0, 451213.0, 452617.0, 454138.0, 30731.692683072884, 31341.68658313479, 31499.0, 31508.84245578849, 31528.0, 51170.48829511806, 51297.0, 51984.74007629938, 52046.21930671119, 52663.0, 42670.0, 44149.77925110354, 44231.115377691625, 44684.32973505335, 45513.772431138954, 42570.57429425666, 42841.1431771369, 43116.56883431251, 43326.0, 44259.55740442554, 43613.34579981239, 43922.24311027523, 44130.55869441393, 44714.3292850614, 44946.3258051123, 36734.265314693024, 37461.62538374581, 37589.81205093957, 38230.0, 38693.806530967166, 28831.855840720662, 29449.0, 29518.262043448227, 29572.704272957857, 29666.258343541584], "value": 21870.56904427897, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [404.4398508066327, 413.9399787030879, 418.13028899888224, 422.2863360920045, 439.2159994409977, 18918.337858174968, 19698.21207151714, 20469.590608187827, 20480.487987800294, 20588.38234852953, 19306.420807375765, 19357.516062098453, 19428.0, 20231.696524552142, 20246.69629955552, 5735.340435849878, 5930.703464826763, 5942.346341902387, 5950.196723442345, 5957.88084238315, 5153.871153221162, 5820.912686309709, 5903.88192236155, 6430.614163150202, 6460.806175814733, 5548.250986116863, 6492.610443373413, 6508.0, 6509.121268628745, 6535.150430444036, 5741.081426971686, 5880.794172203974, 5897.6166549174595, 5906.202662640574, 5908.409159084079, 5034.597232221414, 5333.066713325153, 5373.650712703662, 5419.051665958442, 5436.157395603688, 13567.796483052762, 16485.83514164855, 20019.999000050084, 23949.401264968514, 23958.401039973967, 2404.266698656909, 2412.8311018228733, 2447.375919140608, 2472.1594657816427, 2555.3228394475477, 10528.736781580521, 10552.788944221073, 10621.946890265577, 10710.19673524481, 13789.896808255315, 2023.0, 2136.42316574524, 2137.230596985084, 2224.021430570544, 2243.551289742058, 97373.51313243459, 98907.0, 101343.49328253312, 102013.0, 104224.0, 18985.33551325697, 19120.33078842234, 19137.0, 19283.710744338845, 19836.404907852786, 35295.64704352975, 35371.469427958604, 35598.46602300968, 35603.28793424117, 35683.28633427317, 10634.20243481742, 10917.781644367069, 11029.944850275857, 11087.22389432732, 11113.777724445628, 9209.861852072225, 9234.722958311262, 9255.444673319622, 9400.858987115198, 9438.858417123749, 9490.762730931643, 9553.713388598353, 9765.0, 9922.503874806374, 9974.700758977242, 3416.760826742104, 3598.874039408608, 3749.887503374903, 3796.392577187692, 3812.653574924588, 454.493240037356, 469.4272986955908, 470.4237309296085, 481.64839667043253, 958.8513780364054, 11772.470238839272, 12317.507299707911, 12359.196652217577, 19359.0, 20935.790642093383, 1050.8423736439595, 1053.3574519543072, 1054.9924821795166, 1100.3287994323457, 1119.1382635370883, 10810.189235807346, 11471.483783229774, 11481.425928703531, 11576.421178941187, 11642.35967021805, 509882.0, 512308.0, 513753.0, 529361.0, 592902.0, 105820.0, 107334.46332768287, 107793.46103269591, 108132.0, 108320.45839770751, 1094.102835674755, 1135.875053744104, 1136.3579577538665, 1137.5961533655598, 1146.3981409759942, 17942.282308707505, 18015.0, 18202.45392638223, 18386.632267354846, 18416.81583184151, 39580.60419395769, 42405.57594424016, 43355.0, 44054.55945440505, 45530.54469455396, 58059.0, 59770.402295976484, 61761.0, 65544.67227663832, 65895.67052164709, 5753.683547404933, 7264.818379540342, 7820.748680211139, 8705.085965973482, 8837.204651581389, 12952.222866628032, 13937.163770173822, 14008.579742607739, 14187.006909516647, 14194.92902535522, 12192.085593580694, 12276.44755985965, 12299.200551964093, 12306.81539776922, 12671.80992285135, 11913.523459061887, 11978.76042479128, 12034.939825300817, 12279.201851879956, 12389.690257743629, 12180.390980450764, 12333.321667308384, 12536.561220357244, 12827.615171544869, 12999.545015924397, 7742.341900938258, 7749.302562769378, 8094.10964793884, 8103.432759706764, 8244.752657420288, 11387.601433949772, 11801.940990294994, 11874.0, 11884.82172767392, 12060.216085954386], "value": 10214.16942107666, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1571.2693597477175, 1628.4707470072226, 1786.0980204996474, 1903.6478251523479, 1931.758530183727, 8439.32485401168, 9016.09839016098, 9320.440773553575, 9610.5675244614, 9641.855372169415, 9395.248380129591, 9599.712008639752, 9696.17582505488, 9744.756381090476, 9781.510924453767, 2463.556559819232, 2503.7746602805746, 2507.3982244261338, 2508.5735424977706, 2509.0967251789343, 2440.5973014452684, 2451.656768052474, 2454.828162028659, 2456.2140115163156, 2472.295395812194, 2389.0802041214083, 2402.243293362585, 2417.407735104893, 2419.7096348438213, 2421.878906054699, 2413.3242692046256, 2422.4186195313173, 2456.8771561421945, 2470.258922323296, 2472.554940110779, 2408.1812183857396, 2420.5037967216676, 2434.1480481831395, 2462.8152888533255, 2465.1864884588044, 9637.518124093767, 9719.17387022104, 9720.562574684156, 9722.465264410455, 9728.75678108046, 5547.0, 5713.14302854571, 5738.167965645, 5786.710664466802, 5803.796867109673, 3514.8208110971364, 3577.9105522362147, 3582.3551760683067, 3757.511523501955, 3758.909916124348, 1114.6266000889711, 1137.6416428824894, 1141.8116010858198, 1151.6142092399057, 1185.8636256830403, 13788.862111378958, 13861.099028563212, 13875.37560809766, 13880.375383107785, 13902.860971390359, 5048.1418158913075, 5050.924236136461, 5164.638475306768, 5205.427402985669, 5237.711925844039, 11679.182457227913, 11706.88293117075, 11743.765124697458, 11744.29534227949, 11768.823467647991, 5704.743286552115, 5773.884522309614, 5785.971070144622, 5792.333881603585, 5799.449052340021, 4662.300654901724, 5257.395399529103, 5315.574754019669, 5448.128299472065, 5451.155070964007, 4392.626626736699, 4427.468703755506, 4442.68901176921, 4450.421445212101, 4521.480029796549, 1357.4095268558012, 1383.4742797736997, 1388.9722205555831, 1403.0185855058003, 1406.184413040434, 1040.141882946557, 1082.220801023262, 1085.9022687957963, 1091.154355374591, 1099.9175061870392, 6397.776077837253, 6482.546221764525, 6583.736650534021, 6601.438877695354, 6634.0712300278, 518.4193703052605, 523.8297553295118, 524.8897731476357, 526.6681990346058, 526.94730526947, 4450.599446049806, 4520.81916723334, 4521.186186486464, 4523.819047238139, 4527.524609915911, 10795.190360722978, 11223.831642525369, 11297.209195356247, 11306.0, 11306.660800176009, 11226.66320010401, 11229.382383968798, 11242.213045086766, 11279.492422840993, 11666.0, 8748.300135989106, 9029.548522573845, 9167.17495425415, 9175.58709858058, 9176.541172941326, 6786.185657721105, 7003.859922801414, 7023.438124950094, 7050.612216328152, 7064.0, 11094.889051109385, 11131.05386042163, 11353.886461135613, 11540.538378464767, 11542.0, 11412.144089193509, 11443.14176436754, 11565.479553419947, 11619.767604648028, 11655.242409243372, 7938.920610793818, 8152.429329946846, 8346.66613335484, 8758.781030474034, 8907.465552066897, 9584.37701549397, 9624.0, 9651.131398174199, 9679.08048735369, 9701.272404569545, 8401.495910245405, 8617.612207450555, 8705.608247628745, 8707.521086340312, 8750.737477875675, 8158.428909976482, 8261.793455163668, 8282.83434331298, 8314.501129932223, 8346.081930987708, 7918.485298455582, 7937.365010799007, 8024.759257222293, 8029.51822890605, 8037.03555573335, 5801.0, 5845.883082338414, 5940.762369505172, 5997.430244126801, 6079.696015199134, 5887.58786884931, 5894.764209431574, 5897.764089436375, 6027.969860150672, 6052.546059045677], "value": 4997.68794928466, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [342.6659007467718, 346.8040557085247, 351.36227746639855, 357.3870811558177, 360.5349099661437, 5611.466910643492, 5687.544996400288, 5784.68184249866, 5889.057750759879, 5899.056151015833, 5635.464630860072, 5678.687672178028, 5702.515286200678, 5714.857128571777, 5723.570732195081, 4409.911801763963, 4410.801513931865, 4417.315316126005, 4423.469183697961, 4436.645068394537, 4356.627662286385, 4395.220285324804, 4454.153710794954, 4459.888502787424, 4465.062336909236, 4394.560543945612, 4403.295472724365, 4409.603135717784, 4448.065906159711, 4455.688101832873, 4447.555244475543, 4466.240739074333, 4469.173202957463, 4478.0, 4480.775961201927, 3653.9817300913323, 3852.210296889131, 3957.525096988351, 3973.860914867995, 3981.6814654827544, 5494.752736126884, 5500.064988951888, 5500.1749737539685, 5511.421300763443, 5529.364123125852, 4939.777710003059, 4973.726445045521, 5004.324416203803, 5016.799328026875, 5017.322661440695, 5761.654300741927, 5945.0, 5974.4921681657115, 5976.252968378953, 6007.128966299862, 4193.5387107418155, 4222.387753775716, 4239.703220774547, 4242.7242229255, 4253.553376895412, 6217.87564248717, 6235.96882015587, 6279.591826531261, 6312.810615681537, 6334.303226645019, 4202.348635961431, 4356.6514678825615, 4430.867073987721, 4433.401490798701, 4455.75493347869, 4485.8112600160985, 4496.910061798746, 4497.190505708938, 4501.414816073955, 4508.864734057984, 5077.466865979093, 5110.207917772751, 5121.539061484485, 5130.7178105204575, 5159.1229490986625, 5793.565482588822, 5888.234529511136, 5973.880522389615, 5991.430814072656, 6017.18767966319, 1542.3213785934377, 1555.2845690982049, 1563.351209248172, 1571.3793051744726, 1577.7238983177897, 1001.9599216031277, 1016.4917541229386, 1016.7305663999047, 1023.2990401574945, 1025.8612939637146, 5256.605754568346, 5285.418603953562, 5290.899552846575, 5323.520883120537, 5376.596755243294, 5474.972625136849, 5487.890242195133, 5497.862553436116, 5506.476884695948, 5535.640183388067, 4923.556879880828, 5244.790208391698, 5281.9207711884355, 5321.775991521971, 5322.733863306819, 2894.8999380235377, 2935.6623988241627, 2983.77621678375, 2991.2970451943775, 2998.58019877213, 5706.25818643582, 5778.566607504454, 5825.33008703996, 5842.182094506772, 5891.3814049525035, 5829.950608890441, 6264.185655864709, 6265.8746825063245, 6280.9685951569945, 6322.936770632235, 6442.613443193423, 6457.0, 6460.3216662250725, 6471.611703297817, 6596.67016649156, 6039.939600603938, 6219.191505104308, 6253.593516421418, 6266.154069200599, 6272.874542509216, 6072.878542429038, 6142.293636231711, 6149.200603921461, 6172.382761723792, 6222.719977601109, 6210.534209934363, 6528.118703975093, 6556.409923106943, 6562.80311590653, 6596.80209593713, 4263.424437700871, 4309.5044069932355, 4328.2425575524785, 4328.8268469260875, 4348.847555397885, 5987.221661184019, 6028.703828676856, 6226.59527130735, 6248.343923887926, 6307.211598550181, 5963.91054134197, 5980.282366116094, 5987.712641782038, 5988.131720900358, 5988.520918326611, 6055.0, 6071.7571297147615, 6071.787487437919, 6085.148079268817, 6099.603525770811, 5705.771769129188, 5991.610545314541, 5993.310769261417, 6014.308354539109, 6034.24571928509, 6119.653676191231, 6130.877382452415, 6135.975128207591, 6162.599431036968, 6207.503399728102, 5646.830595082154, 5960.314563825215, 5997.0, 5998.790042348497, 6010.849728756816], "value": 4522.06329721844, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [828.9709860154895, 836.4061516323413, 859.5616235719783, 905.7373361725103, 927.9907200927988, 15474.38102475901, 16767.580810479743, 16774.496765097036, 16781.077040762753, 16848.241829117687, 15732.370705171808, 15822.0, 15855.0, 15911.920440397782, 16041.598960025976, 850.808568072185, 870.6647940542873, 873.10506730601, 885.9689910853122, 887.5029983209423, 888.2716172738325, 889.5107690770083, 889.5107690770083, 889.7419748272993, 890.768400215942, 918.2103391083663, 922.280621115531, 925.1442415765424, 925.1627277314042, 926.8470702334107, 911.1935936696038, 916.5829547555846, 917.7384445433053, 917.9770505737343, 919.8022425178585, 674.3896773420063, 676.3743537228045, 678.4267294136447, 679.0696745458753, 680.601847918968, 14723.852761472355, 14820.851791482055, 14833.480828170963, 14868.553943381608, 14896.329665165094, 14367.78448323276, 14479.855201447956, 14716.484923027643, 15093.0, 15223.31495082724, 13243.602691919257, 13784.448622055106, 13808.447662093504, 13812.792808107886, 13923.860761392358, 4721.811127554894, 4765.142274390609, 4767.61859051275, 4822.493638167977, 4875.829345972909, 79509.0, 80271.0, 80308.59845700793, 80311.19688803154, 80855.0, 12146.696332591757, 12238.571649992207, 12339.0, 12348.320842353578, 12508.499660013498, 21704.56590868174, 21706.674399884014, 21709.131634734433, 21713.56572868534, 21719.67420488694, 9046.81906361869, 9047.140521650434, 9107.22588579965, 9262.536873156316, 9393.107654772786, 4990.5508504234795, 5009.649324547319, 5061.44324124346, 5077.619178561623, 5268.92096618551, 4089.1208390195657, 4320.978395108004, 4344.044310251739, 4352.934705979413, 4379.4525684289465, 739.593223726948, 745.3105877063695, 750.6171852355338, 751.2337415835817, 764.3273918951398, 707.989380159298, 776.4060493722307, 782.1748055801185, 798.6246464161951, 801.3749275565068, 11228.66314010581, 11248.550057997752, 11290.435478226056, 11386.985021060107, 11528.0, 691.7993781803322, 695.422799076765, 736.6500912066725, 745.8657441660445, 821.5892053973014, 5026.611766931683, 5161.251618515369, 5261.973690131601, 5265.921011184835, 5320.920186197211, 74070.0, 75138.24861751312, 108442.45778771213, 133929.0, 136608.31695841457, 65650.67174664096, 104742.47628761808, 105595.0, 112898.0, 116615.41692291484, 94030.52984735032, 94940.52529737307, 97310.51344743231, 98140.50929745448, 99401.0, 9806.264530160124, 9958.502074896081, 9982.247576495063, 10016.0, 10094.495275236355, 56450.43549564452, 57480.0, 58144.709276453345, 58320.70839645775, 59349.703251483465, 72156.0, 86957.56521217353, 87394.56302718446, 88615.0, 90097.09902900887, 13018.414171362501, 13095.41070651842, 13293.401796918968, 13412.750060854081, 13468.5286014989, 15395.307211175748, 15429.151396672842, 15618.609534761268, 15933.840661593236, 16149.19254037317, 14376.712465750417, 14699.191544465157, 14906.627334316729, 15217.695646087237, 15335.846641533888, 14705.852941470876, 14943.77584336214, 14963.700725985202, 14982.625434364229, 15306.693866122838, 14613.853861461675, 14825.703485930437, 14884.702305953604, 14979.625509362353, 15655.530334089995, 12236.938815305866, 12468.127231094099, 12515.749685006067, 12615.87384126147, 12719.109662323548, 12151.513939442324, 12173.69565760863, 12398.380080996094, 12489.437975291316, 12575.245485270912], "value": 8225.020168087673, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1522.4000000000003, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 106.0, 112.0, 110.0, 113.0, 111.0, 111.0, 110.0, 110.0, 111.0], "value": 110.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [158.0, 128.0, 171.0, 184.0, 133.0, 159.0, 150.0, 132.0, 176.0, 127.0], "value": 151.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 163.0, 162.0, 170.0, 161.0, 167.0, 162.0, 163.0, 164.0, 164.0], "value": 163.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 76.0, 78.0, 194.0, 74.0, 76.0, 76.0, 75.0, 186.0, 74.0], "value": 98.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 83.0, 147.0, 84.0, 91.0, 85.0, 142.0, 84.0, 84.0, 152.0], "value": 103.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0], "value": 117.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 146.0, 147.0, 149.0, 146.0, 146.0, 146.0, 147.0, 146.0], "value": 146.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 96.0, 96.0, 98.0, 96.0, 95.0, 96.0, 95.0, 95.0], "value": 95.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 55.0, 54.0, 53.0, 56.0, 52.0, 52.0, 52.0, 53.0, 54.0], "value": 53.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 59.0, 58.0, 59.0, 61.0, 60.0, 60.0, 60.0, 61.0, 65.0], "value": 60.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 76.0, 75.0, 78.0, 80.0, 82.0, 77.0, 80.0, 103.0, 77.0], "value": 80.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [134.0, 125.0, 126.0, 116.0, 117.0, 120.0, 132.0, 125.0, 128.0, 122.0], "value": 124.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 157.0, 154.0, 153.0, 152.0, 153.0, 154.0, 160.0, 158.0, 152.0], "value": 154.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 61.0, 61.0, 62.0, 61.0, 59.0, 61.0, 60.0, 59.0, 62.0], "value": 60.9, "unit": "score"}]}]} 06:24:32 INFO - Return code: 0 06:24:32 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 06:24:32 ERROR - # TBPL SUCCESS # 06:24:32 INFO - Running post-action listener: _resource_record_post_action 06:24:32 INFO - ##### 06:24:32 INFO - ##### Finished run-tests step (success) 06:24:32 INFO - ##### 06:24:32 INFO - Running post-run listener: _resource_record_post_run 06:24:32 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 0; Write bytes: 505069568; Read time: 0; Write time: 357184 06:24:32 INFO - TinderboxPrint: CPU usage
13.4% 06:24:32 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 06:24:32 INFO - TinderboxPrint: I/O write bytes / time
505,069,568 / 357,184 06:24:32 INFO - TinderboxPrint: CPU idle
8,208.6 (86.6%) 06:24:32 INFO - TinderboxPrint: CPU user
1,214.9 (12.8%) 06:24:32 INFO - TinderboxPrint: Swap in / out
0 / 0 06:24:32 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 252698624; Read time: 0; Write time: 228140 06:24:32 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 0; Write bytes: 252370944; Read time: 0; Write time: 129044 06:24:33 INFO - Running post-run listener: _upload_blobber_files 06:24:33 INFO - Blob upload gear active. 06:24:33 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:24:33 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 06:24:33 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'] 06:24:33 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 06:24:33 INFO - (blobuploader) - INFO - Open directory for files ... 06:24:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 06:24:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:24:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:24:34 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 06:24:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:24:34 INFO - (blobuploader) - INFO - Done attempting. 06:24:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 06:24:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:24:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:24:37 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 06:24:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:24:37 INFO - (blobuploader) - INFO - Done attempting. 06:24:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 06:24:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:24:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:24:38 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 06:24:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:24:38 INFO - (blobuploader) - INFO - Done attempting. 06:24:38 INFO - (blobuploader) - INFO - Iteration through files over. 06:24:38 INFO - Return code: 0 06:24:38 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:24:38 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:24:38 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3e2b3855bfabfc996ce8c6bb867ebabee66fd524d00f4bd0f2044ee5aedd297b384839041ebc34d37e35645bd5402c7d034af0f7e2f17b929204c271c550a816", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0507eb0b1623eec81ae02a8972c970af03a94f40c96a1603c8b91d46158270826c9ecba3d1b0deecb63826c11dcc747f1df601f1f4940725f1def0e72c43e47d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/77525f07ac1612e322d73faae340e75130ca1f2e88cfb0cb41562162a4add6df3071841c4b6b326f10d7901a96e7e0fbeabc708822457138325b43719a843306"} 06:24:38 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:24:38 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:24:38 INFO - Contents: 06:24:38 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3e2b3855bfabfc996ce8c6bb867ebabee66fd524d00f4bd0f2044ee5aedd297b384839041ebc34d37e35645bd5402c7d034af0f7e2f17b929204c271c550a816", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0507eb0b1623eec81ae02a8972c970af03a94f40c96a1603c8b91d46158270826c9ecba3d1b0deecb63826c11dcc747f1df601f1f4940725f1def0e72c43e47d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/77525f07ac1612e322d73faae340e75130ca1f2e88cfb0cb41562162a4add6df3071841c4b6b326f10d7901a96e7e0fbeabc708822457138325b43719a843306"} 06:24:38 INFO - Running post-run listener: copy_logs_to_upload_dir 06:24:38 INFO - Copying logs to upload dir... 06:24:38 INFO - mkdir: /builds/slave/test/build/upload/logs 06:24:38 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1235.979852 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-07-06 06:24:38.120530) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-06 06:24:38.123904) ========= 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=bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183 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/3e2b3855bfabfc996ce8c6bb867ebabee66fd524d00f4bd0f2044ee5aedd297b384839041ebc34d37e35645bd5402c7d034af0f7e2f17b929204c271c550a816", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0507eb0b1623eec81ae02a8972c970af03a94f40c96a1603c8b91d46158270826c9ecba3d1b0deecb63826c11dcc747f1df601f1f4940725f1def0e72c43e47d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/77525f07ac1612e322d73faae340e75130ca1f2e88cfb0cb41562162a4add6df3071841c4b6b326f10d7901a96e7e0fbeabc708822457138325b43719a843306"} build_url:https://queue.taskcluster.net/v1/task/bmkoLsHkT9aVlMexqqw9-w/artifacts/public/build/firefox-49.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011347 build_url: 'https://queue.taskcluster.net/v1/task/bmkoLsHkT9aVlMexqqw9-w/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/3e2b3855bfabfc996ce8c6bb867ebabee66fd524d00f4bd0f2044ee5aedd297b384839041ebc34d37e35645bd5402c7d034af0f7e2f17b929204c271c550a816", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/0507eb0b1623eec81ae02a8972c970af03a94f40c96a1603c8b91d46158270826c9ecba3d1b0deecb63826c11dcc747f1df601f1f4940725f1def0e72c43e47d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/77525f07ac1612e322d73faae340e75130ca1f2e88cfb0cb41562162a4add6df3071841c4b6b326f10d7901a96e7e0fbeabc708822457138325b43719a843306"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-06 06:24:38.148905) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 06:24:38.149203) ========= 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=bb9b54edd4a927dc735d112f000001d9-1467804515.197978-1830299183 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004429 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-06 06:24:38.234412) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-06 06:24:38.234786) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-06 06:24:38.235180) ========= ========= Total master_lag: 0.17 =========