builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-045 starttime: 1464651405.23 results: success (0) buildid: 20160526140250 builduid: 01574422c30242cc92a6c0b32dab29da revision: 2ee4473c729acb2ba7dc723e7affe79ce14bff85 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-05-30 16:36:45.227876) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-05-30 16:36:45.228274) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-30 16:36:45.228575) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-30 16:36:45.383984) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 16:36:45.384292) ========= 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=4300f881736b422476174874000001bc-1464650960.296021-1071286981 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-05-30 16:36:45-- 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% 70.0M=0s 2016-05-30 16:36:46 (70.0 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.124659 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 16:36:45.533861) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 16:36:45.534182) ========= 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=4300f881736b422476174874000001bc-1464650960.296021-1071286981 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020923 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 16:36:45.593775) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-05-30 16:36:45.594124) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 2ee4473c729acb2ba7dc723e7affe79ce14bff85 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 2ee4473c729acb2ba7dc723e7affe79ce14bff85 --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=4300f881736b422476174874000001bc-1464650960.296021-1071286981 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-05-30 16:36:46,206 truncating revision to first 12 chars 2016-05-30 16:36:46,206 Setting DEBUG logging. 2016-05-30 16:36:46,206 attempt 1/10 2016-05-30 16:36:46,206 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/2ee4473c729a?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-05-30 16:36:47,576 unpacking tar archive at: mozilla-beta-2ee4473c729a/testing/mozharness/ program finished with exit code 0 elapsedTime=1.693764 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-05-30 16:36:47.309149) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-30 16:36:47.309854) ========= script_repo_revision: 2ee4473c729acb2ba7dc723e7affe79ce14bff85 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-30 16:36:47.310301) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-30 16:36:47.310608) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-30 16:36:47.320283) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 55 secs) (at 2016-05-30 16:36:47.320615) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1464650960.296021-1071286981 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 16:36:48 INFO - MultiFileLogger online at 20160530 16:36:48 in /builds/slave/test 16:36:48 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 16:36:48 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:36:48 INFO - {'append_to_log': False, 16:36:48 INFO - 'base_work_dir': '/builds/slave/test', 16:36:48 INFO - 'blob_upload_branch': 'Mozilla-Beta', 16:36:48 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:36:48 INFO - 'branch': 'Mozilla-Beta', 16:36:48 INFO - 'buildbot_json_path': 'buildprops.json', 16:36:48 INFO - 'config_files': ('talos/linux_config.py',), 16:36:48 INFO - 'default_actions': ('clobber', 16:36:48 INFO - 'read-buildbot-config', 16:36:48 INFO - 'download-and-extract', 16:36:48 INFO - 'populate-webroot', 16:36:48 INFO - 'create-virtualenv', 16:36:48 INFO - 'install', 16:36:48 INFO - 'run-tests'), 16:36:48 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:36:48 INFO - 'download_minidump_stackwalk': True, 16:36:48 INFO - 'download_symbols': 'ondemand', 16:36:48 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:36:48 INFO - 'tooltool.py': '/tools/tooltool.py', 16:36:48 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:36:48 INFO - '/tools/misc-python/virtualenv.py')}, 16:36:48 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:36:48 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:36:48 INFO - 'installer_path': 'installer.exe', 16:36:48 INFO - 'log_level': 'info', 16:36:48 INFO - 'log_name': 'talos', 16:36:48 INFO - 'log_to_console': True, 16:36:48 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 16:36:48 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 16:36:48 INFO - 'opt_config_files': (), 16:36:48 INFO - 'pip_index': False, 16:36:48 INFO - 'sps_profile': False, 16:36:48 INFO - 'sps_profile_interval': 0, 16:36:48 INFO - 'suite': 'dromaeojs-e10s', 16:36:48 INFO - 'system_bits': '32', 16:36:48 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:36:48 INFO - 'title': 'talos-linux64-ix-045', 16:36:48 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:36:48 INFO - 'use_talos_json': True, 16:36:48 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:36:48 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:36:48 INFO - 'work_dir': 'build'} 16:36:48 INFO - ##### 16:36:48 INFO - ##### Running clobber step. 16:36:48 INFO - ##### 16:36:48 INFO - Running pre-action listener: _resource_record_pre_action 16:36:48 INFO - Running main action method: clobber 16:36:48 INFO - rmtree: /builds/slave/test/build 16:36:48 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:36:48 INFO - Running post-action listener: _resource_record_post_action 16:36:48 INFO - ##### 16:36:48 INFO - ##### Running read-buildbot-config step. 16:36:48 INFO - ##### 16:36:48 INFO - Running pre-action listener: _resource_record_pre_action 16:36:48 INFO - Running main action method: read_buildbot_config 16:36:48 INFO - Using buildbot properties: 16:36:48 INFO - { 16:36:48 INFO - "project": "", 16:36:48 INFO - "product": "firefox", 16:36:48 INFO - "script_repo_revision": "production", 16:36:48 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s", 16:36:48 INFO - "repository": "", 16:36:48 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs-e10s", 16:36:48 INFO - "buildid": "20160526140250", 16:36:48 INFO - "pgo_build": "True", 16:36:48 INFO - "basedir": "/builds/slave/test", 16:36:48 INFO - "buildnumber": 115, 16:36:48 INFO - "slavename": "talos-linux64-ix-045", 16:36:48 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 16:36:48 INFO - "platform": "ubuntu64_hw", 16:36:48 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 16:36:48 INFO - "branch": "mozilla-beta", 16:36:48 INFO - "repo_path": "releases/mozilla-beta", 16:36:48 INFO - "revision": "2ee4473c729acb2ba7dc723e7affe79ce14bff85", 16:36:48 INFO - "stage_platform": "linux64-pgo", 16:36:48 INFO - "builduid": "01574422c30242cc92a6c0b32dab29da", 16:36:48 INFO - "slavebuilddir": "test" 16:36:48 INFO - } 16:36:48 INFO - Found installer url https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2. 16:36:48 INFO - Running post-action listener: _resource_record_post_action 16:36:48 INFO - ##### 16:36:48 INFO - ##### Running download-and-extract step. 16:36:48 INFO - ##### 16:36:48 INFO - Running pre-action listener: _resource_record_pre_action 16:36:48 INFO - Running main action method: download_and_extract 16:36:48 INFO - mkdir: /builds/slave/test/build/tests 16:36:48 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')]} 16:36:48 INFO - https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 16:36:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 16:36:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 16:36:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 16:36:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.test_packages.json'}, attempt #1 16:37:01 INFO - Downloaded 1412 bytes. 16:37:01 INFO - Reading from file /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 16:37:01 INFO - Using the following test package requirements: 16:37:01 INFO - {u'common': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 16:37:01 INFO - u'cppunittest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:37:01 INFO - u'firefox-47.0.en-US.linux-x86_64.cppunittest.tests.zip'], 16:37:01 INFO - u'gtest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:37:01 INFO - u'firefox-47.0.en-US.linux-x86_64.gtest.tests.zip'], 16:37:01 INFO - u'jittest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:37:01 INFO - u'jsshell-linux-x86_64.zip'], 16:37:01 INFO - u'mochitest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:37:01 INFO - u'firefox-47.0.en-US.linux-x86_64.mochitest.tests.zip'], 16:37:01 INFO - u'mozbase': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 16:37:01 INFO - u'reftest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:37:01 INFO - u'firefox-47.0.en-US.linux-x86_64.reftest.tests.zip'], 16:37:01 INFO - u'talos': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:37:01 INFO - u'firefox-47.0.en-US.linux-x86_64.talos.tests.zip'], 16:37:01 INFO - u'web-platform': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:37:01 INFO - u'firefox-47.0.en-US.linux-x86_64.web-platform.tests.zip'], 16:37:01 INFO - u'webapprt': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 16:37:01 INFO - u'xpcshell': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 16:37:01 INFO - u'firefox-47.0.en-US.linux-x86_64.xpcshell.tests.zip']} 16:37:01 INFO - Downloading packages: [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 16:37:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:01 INFO - https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 16:37:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 16:37:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 16:37:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 16:37:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 16:37:22 INFO - Downloaded 23434470 bytes. 16:37:22 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 16:37:22 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 16:37:23 INFO - Return code: 0 16:37:23 INFO - Downloading packages: [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 16:37:23 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')]} 16:37:23 INFO - https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 16:37:23 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 16:37:23 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 16:37:23 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 16:37:23 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 16:37:25 INFO - Downloaded 23434470 bytes. 16:37:25 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 16:37:25 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 16:37:26 INFO - Return code: 0 16:37:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:26 INFO - https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 16:37:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 16:37:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 16:37:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 16:37:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 16:37:27 INFO - Downloaded 10845194 bytes. 16:37:27 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 16:37:27 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 16:37:27 INFO - Return code: 0 16:37: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')]} 16:37:27 INFO - https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 16:37:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 16:37:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 16:37:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 16:37:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.tar.bz2'}, attempt #1 16:37:30 INFO - Downloaded 53860430 bytes. 16:37:30 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 16:37:30 INFO - mkdir: /builds/slave/test/properties 16:37:30 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:37:30 INFO - Writing to file /builds/slave/test/properties/build_url 16:37:30 INFO - Contents: 16:37:30 INFO - build_url:https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 16:37:31 INFO - Running post-action listener: _resource_record_post_action 16:37:31 INFO - Running post-action listener: set_extra_try_arguments 16:37:31 INFO - ##### 16:37:31 INFO - ##### Running populate-webroot step. 16:37:31 INFO - ##### 16:37:31 INFO - Running pre-action listener: _resource_record_pre_action 16:37:31 INFO - Running main action method: populate_webroot 16:37:31 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:37:31 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:37:31 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:37:31 INFO - '--tppagecycles', 16:37:31 INFO - '7'], 16:37:31 INFO - 'tests': ['tsvgm']}}, 16:37:31 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 16:37:31 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 16:37:31 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:37:31 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 16:37:31 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 16:37:31 INFO - 'tests': ['dromaeo_css', 'kraken']}, 16:37:31 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:37:31 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:37:31 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:37:31 INFO - 'talos_options': ['--e10s'], 16:37:31 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:37:31 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:37:31 INFO - 'tests': ['damp', 'tps']}, 16:37:31 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:37:31 INFO - 'talos_options': ['--e10s'], 16:37:31 INFO - 'tests': ['damp', 'tps']}, 16:37:31 INFO - 'g3': {'tests': ['dromaeo_dom']}, 16:37:31 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:37:31 INFO - 'other': {'tests': ['a11yr', 16:37:31 INFO - 'ts_paint', 16:37:31 INFO - 'tpaint', 16:37:31 INFO - 'sessionrestore', 16:37:31 INFO - 'sessionrestore_no_auto_restore', 16:37:31 INFO - 'tabpaint']}, 16:37:31 INFO - 'other-e10s': {'talos_options': ['--e10s'], 16:37:31 INFO - 'tests': ['a11yr', 16:37:31 INFO - 'ts_paint', 16:37:31 INFO - 'tpaint', 16:37:31 INFO - 'sessionrestore', 16:37:31 INFO - 'sessionrestore_no_auto_restore', 16:37:31 INFO - 'tabpaint']}, 16:37:31 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 16:37:31 INFO - 'tests': ['a11yr', 16:37:31 INFO - 'ts_paint', 16:37:31 INFO - 'tpaint', 16:37:31 INFO - 'sessionrestore', 16:37:31 INFO - 'sessionrestore_no_auto_restore', 16:37:31 INFO - 'tabpaint']}, 16:37:31 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 16:37:31 INFO - 'tests': ['a11yr', 16:37:31 INFO - 'ts_paint', 16:37:31 INFO - 'tpaint', 16:37:31 INFO - 'sessionrestore', 16:37:31 INFO - 'sessionrestore_no_auto_restore', 16:37:31 INFO - 'tabpaint']}, 16:37:31 INFO - 'other_l64': {'tests': ['a11yr', 16:37:31 INFO - 'ts_paint', 16:37:31 INFO - 'tpaint', 16:37:31 INFO - 'sessionrestore', 16:37:31 INFO - 'sessionrestore_no_auto_restore', 16:37:31 INFO - 'tabpaint']}, 16:37:31 INFO - 'other_nol64': {'tests': ['a11yr', 16:37:31 INFO - 'ts_paint', 16:37:31 INFO - 'tpaint', 16:37:31 INFO - 'sessionrestore', 16:37:31 INFO - 'sessionrestore_no_auto_restore', 16:37:31 INFO - 'tabpaint']}, 16:37:31 INFO - 'svgr': {'tests': ['tsvgx', 16:37:31 INFO - 'tsvgr_opacity', 16:37:31 INFO - 'tart', 16:37:31 INFO - 'tscrollx', 16:37:31 INFO - 'cart']}, 16:37:31 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 16:37:31 INFO - 'tests': ['tsvgx', 16:37:31 INFO - 'tsvgr_opacity', 16:37:31 INFO - 'tart', 16:37:31 INFO - 'tscrollx', 16:37:31 INFO - 'cart']}, 16:37:31 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:37:31 INFO - 'tests': ['tp5o']}, 16:37:31 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:37:31 INFO - 'talos_options': ['--e10s'], 16:37:31 INFO - 'tests': ['tp5o']}, 16:37:31 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:37:31 INFO - 'talos_options': ['--xperf_path', 16:37:31 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:37:31 INFO - 'tests': ['tp5n']}, 16:37:31 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:37:31 INFO - 'talos_options': ['--e10s', 16:37:31 INFO - '--xperf_path', 16:37:31 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:37:31 INFO - 'tests': ['tp5n']}}, 16:37:31 INFO - 'talos.zip': {'path': '', 16:37:31 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:37:31 INFO - Running post-action listener: _resource_record_post_action 16:37:31 INFO - ##### 16:37:31 INFO - ##### Running create-virtualenv step. 16:37:31 INFO - ##### 16:37:31 INFO - Running pre-action listener: _resource_record_pre_action 16:37:31 INFO - Running main action method: create_virtualenv 16:37:31 INFO - Creating virtualenv /builds/slave/test/build/venv 16:37:31 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 16:37:31 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:37:31 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:37:31 INFO - Using real prefix '/usr' 16:37:31 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:37:32 INFO - Installing distribute.............................................................................................................................................................................................done. 16:37:34 INFO - Installing pip.................done. 16:37:34 INFO - Return code: 0 16:37:34 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:37:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:37:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:37:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:34 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff727e1ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xec78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf94410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1023160>, '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 0x1024060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10244f0>, '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': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', '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 16:37:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 16:37:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 16:37:34 INFO - Using env: {'DISPLAY': ':0', 16:37:34 INFO - 'HOME': '/home/cltbld', 16:37:34 INFO - 'LANG': 'en_US.UTF-8', 16:37:34 INFO - 'LANGUAGE': 'en_US:en', 16:37:34 INFO - 'LOGNAME': 'cltbld', 16:37:34 INFO - 'MAIL': '/var/mail/cltbld', 16:37:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:37:34 INFO - 'MOZ_NO_REMOTE': '1', 16:37:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:37:34 INFO - 'NO_EM_RESTART': '1', 16:37:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:37:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:37:34 INFO - 'PWD': '/builds/slave/test', 16:37:34 INFO - 'SHELL': '/bin/bash', 16:37:34 INFO - 'SHLVL': '1', 16:37:34 INFO - 'TERM': 'linux', 16:37:34 INFO - 'TMOUT': '86400', 16:37:34 INFO - 'USER': 'cltbld', 16:37:34 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', 16:37:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:37:34 INFO - '_': '/tools/buildbot/bin/python'} 16:37:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:37:34 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 16:37:34 INFO - Cleaning up... 16:37:34 INFO - Return code: 0 16:37:34 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 16:37:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:37:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:37:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:34 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff727e1ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xec78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf94410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1023160>, '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 0x1024060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10244f0>, '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': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', '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 16:37:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 16:37:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 16:37:34 INFO - Using env: {'DISPLAY': ':0', 16:37:34 INFO - 'HOME': '/home/cltbld', 16:37:34 INFO - 'LANG': 'en_US.UTF-8', 16:37:34 INFO - 'LANGUAGE': 'en_US:en', 16:37:34 INFO - 'LOGNAME': 'cltbld', 16:37:34 INFO - 'MAIL': '/var/mail/cltbld', 16:37:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:37:34 INFO - 'MOZ_NO_REMOTE': '1', 16:37:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:37:34 INFO - 'NO_EM_RESTART': '1', 16:37:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:37:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:37:34 INFO - 'PWD': '/builds/slave/test', 16:37:34 INFO - 'SHELL': '/bin/bash', 16:37:34 INFO - 'SHLVL': '1', 16:37:34 INFO - 'TERM': 'linux', 16:37:34 INFO - 'TMOUT': '86400', 16:37:34 INFO - 'USER': 'cltbld', 16:37:34 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', 16:37:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:37:34 INFO - '_': '/tools/buildbot/bin/python'} 16:37:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:37:34 INFO - Downloading/unpacking psutil>=0.7.1 16:37:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:37:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:37:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:37:36 INFO - Installing collected packages: psutil 16:37:36 INFO - Running setup.py install for psutil 16:37:36 INFO - building 'psutil._psutil_linux' extension 16:37:36 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 16:37:36 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 16:37:36 INFO - building 'psutil._psutil_posix' extension 16:37:36 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 16:37:36 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 16:37:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:37:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:37:36 INFO - Successfully installed psutil 16:37:36 INFO - Cleaning up... 16:37:36 INFO - Return code: 0 16:37:36 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 16:37: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')]} 16:37:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:37:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37: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')]} 16:37:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:37:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff727e1ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xec78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf94410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1023160>, '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 0x1024060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10244f0>, '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': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', '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 16:37:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 16:37:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 16:37:36 INFO - Using env: {'DISPLAY': ':0', 16:37:36 INFO - 'HOME': '/home/cltbld', 16:37:36 INFO - 'LANG': 'en_US.UTF-8', 16:37:36 INFO - 'LANGUAGE': 'en_US:en', 16:37:36 INFO - 'LOGNAME': 'cltbld', 16:37:36 INFO - 'MAIL': '/var/mail/cltbld', 16:37:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:37:36 INFO - 'MOZ_NO_REMOTE': '1', 16:37:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:37:36 INFO - 'NO_EM_RESTART': '1', 16:37:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:37:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:37:36 INFO - 'PWD': '/builds/slave/test', 16:37:36 INFO - 'SHELL': '/bin/bash', 16:37:36 INFO - 'SHLVL': '1', 16:37:36 INFO - 'TERM': 'linux', 16:37:36 INFO - 'TMOUT': '86400', 16:37:36 INFO - 'USER': 'cltbld', 16:37:36 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', 16:37:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:37:36 INFO - '_': '/tools/buildbot/bin/python'} 16:37:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:37:37 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 16:37:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:39 INFO - Downloading mozsystemmonitor-0.0.tar.gz 16:37:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:37:39 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 16:37:39 INFO - Installing collected packages: mozsystemmonitor 16:37:39 INFO - Running setup.py install for mozsystemmonitor 16:37:39 INFO - Successfully installed mozsystemmonitor 16:37:39 INFO - Cleaning up... 16:37:39 INFO - Return code: 0 16:37:39 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:37:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:37:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:37:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:39 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff727e1ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xec78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf94410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1023160>, '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 0x1024060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10244f0>, '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': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', '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 16:37:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 16:37:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 16:37:39 INFO - Using env: {'DISPLAY': ':0', 16:37:39 INFO - 'HOME': '/home/cltbld', 16:37:39 INFO - 'LANG': 'en_US.UTF-8', 16:37:39 INFO - 'LANGUAGE': 'en_US:en', 16:37:39 INFO - 'LOGNAME': 'cltbld', 16:37:39 INFO - 'MAIL': '/var/mail/cltbld', 16:37:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:37:39 INFO - 'MOZ_NO_REMOTE': '1', 16:37:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:37:39 INFO - 'NO_EM_RESTART': '1', 16:37:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:37:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:37:39 INFO - 'PWD': '/builds/slave/test', 16:37:39 INFO - 'SHELL': '/bin/bash', 16:37:39 INFO - 'SHLVL': '1', 16:37:39 INFO - 'TERM': 'linux', 16:37:39 INFO - 'TMOUT': '86400', 16:37:39 INFO - 'USER': 'cltbld', 16:37:39 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', 16:37:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:37:39 INFO - '_': '/tools/buildbot/bin/python'} 16:37:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:37:39 INFO - Downloading/unpacking blobuploader==1.2.4 16:37:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:41 INFO - Downloading blobuploader-1.2.4.tar.gz 16:37:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:37:41 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:37: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 16:37: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 16:37: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 16:37: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 16:37: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 16:37: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 16:37:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:37:41 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:37: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 16:37: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 16:37: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 16:37: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 16:37: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 16:37: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 16:37:42 INFO - Downloading docopt-0.6.1.tar.gz 16:37:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:37:42 INFO - Installing collected packages: blobuploader, requests, docopt 16:37:42 INFO - Running setup.py install for blobuploader 16:37:42 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:37:42 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:37:42 INFO - Running setup.py install for requests 16:37:42 INFO - Running setup.py install for docopt 16:37:42 INFO - Successfully installed blobuploader requests docopt 16:37:42 INFO - Cleaning up... 16:37:42 INFO - Return code: 0 16:37:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:37:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:37:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:37:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff727e1ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xec78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf94410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1023160>, '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 0x1024060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10244f0>, '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': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', '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 16:37:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 16:37:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:37:42 INFO - Using env: {'DISPLAY': ':0', 16:37:42 INFO - 'HOME': '/home/cltbld', 16:37:42 INFO - 'LANG': 'en_US.UTF-8', 16:37:42 INFO - 'LANGUAGE': 'en_US:en', 16:37:42 INFO - 'LOGNAME': 'cltbld', 16:37:42 INFO - 'MAIL': '/var/mail/cltbld', 16:37:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:37:42 INFO - 'MOZ_NO_REMOTE': '1', 16:37:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:37:42 INFO - 'NO_EM_RESTART': '1', 16:37:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:37:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:37:42 INFO - 'PWD': '/builds/slave/test', 16:37:42 INFO - 'SHELL': '/bin/bash', 16:37:42 INFO - 'SHLVL': '1', 16:37:42 INFO - 'TERM': 'linux', 16:37:42 INFO - 'TMOUT': '86400', 16:37:42 INFO - 'USER': 'cltbld', 16:37:42 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', 16:37:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:37:42 INFO - '_': '/tools/buildbot/bin/python'} 16:37:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:37:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:37:42 INFO - Running setup.py (path:/tmp/pip-nm_9Nx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:37:43 INFO - Running setup.py (path:/tmp/pip-GwJI9K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:37:43 INFO - Running setup.py (path:/tmp/pip-PpfpiQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:37:43 INFO - Running setup.py (path:/tmp/pip-bOLJe0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:37:43 INFO - Running setup.py (path:/tmp/pip-e8muQy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:37:43 INFO - Running setup.py (path:/tmp/pip-d3Zs4c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:37:43 INFO - Running setup.py (path:/tmp/pip-ojpaF9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:37:43 INFO - Running setup.py (path:/tmp/pip-DYYaOm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:37:43 INFO - Running setup.py (path:/tmp/pip-ce0ytk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:37:43 INFO - Running setup.py (path:/tmp/pip-5FcUmz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:37:43 INFO - Running setup.py (path:/tmp/pip-miL6IY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:37:43 INFO - Running setup.py (path:/tmp/pip-NNGfx_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:37:43 INFO - Running setup.py (path:/tmp/pip-jzQj1I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:37:43 INFO - Running setup.py (path:/tmp/pip-OZvg_q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:37:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:37:43 INFO - Running setup.py (path:/tmp/pip-aeoq9C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:37:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:37:44 INFO - Running setup.py (path:/tmp/pip-d1Nfki-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:37:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:37:44 INFO - Running setup.py (path:/tmp/pip-rg4T1Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:37:44 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:37:44 INFO - Running setup.py install for manifestparser 16:37:44 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:37:44 INFO - Running setup.py install for mozcrash 16:37:44 INFO - Running setup.py install for mozdebug 16:37:44 INFO - Running setup.py install for mozdevice 16:37:44 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 16:37:44 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:37:44 INFO - Running setup.py install for mozfile 16:37:44 INFO - Running setup.py install for mozhttpd 16:37:44 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:37:44 INFO - Running setup.py install for mozinfo 16:37:44 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:37:44 INFO - Running setup.py install for mozInstall 16:37:44 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:37:44 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:37:44 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:37:44 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:37:44 INFO - Running setup.py install for mozleak 16:37:45 INFO - Running setup.py install for mozlog 16:37:45 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:37:45 INFO - Running setup.py install for moznetwork 16:37:45 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:37:45 INFO - Running setup.py install for mozprocess 16:37:45 INFO - Running setup.py install for mozprofile 16:37:45 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:37:45 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:37:45 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:37:45 INFO - Running setup.py install for mozrunner 16:37:45 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:37:45 INFO - Running setup.py install for mozscreenshot 16:37:45 INFO - Running setup.py install for moztest 16:37:45 INFO - Running setup.py install for mozversion 16:37:45 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:37:45 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:37:45 INFO - Cleaning up... 16:37:45 INFO - Return code: 0 16:37:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:37:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:37:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:37:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:45 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff727e1ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xec78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf94410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1023160>, '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 0x1024060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10244f0>, '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': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', '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 16:37:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 16:37:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:37:45 INFO - Using env: {'DISPLAY': ':0', 16:37:45 INFO - 'HOME': '/home/cltbld', 16:37:45 INFO - 'LANG': 'en_US.UTF-8', 16:37:45 INFO - 'LANGUAGE': 'en_US:en', 16:37:45 INFO - 'LOGNAME': 'cltbld', 16:37:45 INFO - 'MAIL': '/var/mail/cltbld', 16:37:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:37:45 INFO - 'MOZ_NO_REMOTE': '1', 16:37:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:37:45 INFO - 'NO_EM_RESTART': '1', 16:37:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:37:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:37:45 INFO - 'PWD': '/builds/slave/test', 16:37:45 INFO - 'SHELL': '/bin/bash', 16:37:45 INFO - 'SHLVL': '1', 16:37:45 INFO - 'TERM': 'linux', 16:37:45 INFO - 'TMOUT': '86400', 16:37:45 INFO - 'USER': 'cltbld', 16:37:45 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', 16:37:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:37:45 INFO - '_': '/tools/buildbot/bin/python'} 16:37:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:37:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:37:46 INFO - Running setup.py (path:/tmp/pip-NInM8h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:37:46 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 16:37:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:37:46 INFO - Running setup.py (path:/tmp/pip-yPZK2u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:37:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:37:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:37:46 INFO - Running setup.py (path:/tmp/pip-HsTCOv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:37:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 16:37:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:37:46 INFO - Running setup.py (path:/tmp/pip-6Olx4C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:37:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:37:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:37:46 INFO - Running setup.py (path:/tmp/pip-HuOL6j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:37:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 16:37:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:37:46 INFO - Running setup.py (path:/tmp/pip-0OBuxW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:37:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 16:37:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:37:46 INFO - Running setup.py (path:/tmp/pip-M7bsou-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:37:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 16:37:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:37:46 INFO - Running setup.py (path:/tmp/pip-E8xO03-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:37:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 16:37:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:37:46 INFO - Running setup.py (path:/tmp/pip-Pp346i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:37:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 16:37:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:37:46 INFO - Running setup.py (path:/tmp/pip-Q7SLvg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:37:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:37:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:37:46 INFO - Running setup.py (path:/tmp/pip-wjBULd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:37:46 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 16:37:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:37:46 INFO - Running setup.py (path:/tmp/pip-YgNYUi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:37:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 16:37:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:37:47 INFO - Running setup.py (path:/tmp/pip-_J8ezJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:37:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 16:37:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:37:47 INFO - Running setup.py (path:/tmp/pip-oE8Q4X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:37:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 16:37:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:37:47 INFO - Running setup.py (path:/tmp/pip-5yGwWx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:37:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 16:37:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:37:47 INFO - Running setup.py (path:/tmp/pip-ynZz_K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:37:47 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 16:37:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:37:47 INFO - Running setup.py (path:/tmp/pip-e5RyRy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:37:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 16:37:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:37:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:37:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 16:37:47 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:37:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:37:47 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:37:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:49 INFO - Downloading blessings-1.6.tar.gz 16:37:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:37:49 INFO - Installing collected packages: blessings 16:37:49 INFO - Running setup.py install for blessings 16:37:49 INFO - Successfully installed blessings 16:37:49 INFO - Cleaning up... 16:37:49 INFO - Return code: 0 16:37:49 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:37:49 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:37:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:37:49 INFO - Reading from file tmpfile_stdout 16:37:49 INFO - Current package versions: 16:37:49 INFO - argparse == 1.2.1 16:37:49 INFO - blessings == 1.6 16:37:49 INFO - blobuploader == 1.2.4 16:37:49 INFO - docopt == 0.6.1 16:37:49 INFO - manifestparser == 1.1 16:37:49 INFO - mozInstall == 1.12 16:37:49 INFO - mozcrash == 0.17 16:37:49 INFO - mozdebug == 0.1 16:37:49 INFO - mozdevice == 0.48 16:37:49 INFO - mozfile == 1.2 16:37:49 INFO - mozhttpd == 0.7 16:37:49 INFO - mozinfo == 0.9 16:37:49 INFO - mozleak == 0.1 16:37:49 INFO - mozlog == 3.1 16:37:49 INFO - moznetwork == 0.27 16:37:49 INFO - mozprocess == 0.22 16:37:49 INFO - mozprofile == 0.28 16:37:49 INFO - mozrunner == 6.11 16:37:49 INFO - mozscreenshot == 0.1 16:37:49 INFO - mozsystemmonitor == 0.0 16:37:49 INFO - moztest == 0.7 16:37:49 INFO - mozversion == 1.4 16:37:49 INFO - psutil == 3.1.1 16:37:49 INFO - requests == 1.2.3 16:37:49 INFO - wsgiref == 0.1.2 16:37:49 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:37:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:37:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:37:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff727e1ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xec78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf94410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1023160>, '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 0x1024060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10244f0>, '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': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', '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 16:37:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 16:37:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:37:49 INFO - Using env: {'DISPLAY': ':0', 16:37:49 INFO - 'HOME': '/home/cltbld', 16:37:49 INFO - 'LANG': 'en_US.UTF-8', 16:37:49 INFO - 'LANGUAGE': 'en_US:en', 16:37:49 INFO - 'LOGNAME': 'cltbld', 16:37:49 INFO - 'MAIL': '/var/mail/cltbld', 16:37:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:37:49 INFO - 'MOZ_NO_REMOTE': '1', 16:37:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:37:49 INFO - 'NO_EM_RESTART': '1', 16:37:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:37:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:37:49 INFO - 'PWD': '/builds/slave/test', 16:37:49 INFO - 'SHELL': '/bin/bash', 16:37:49 INFO - 'SHLVL': '1', 16:37:49 INFO - 'TERM': 'linux', 16:37:49 INFO - 'TMOUT': '86400', 16:37:49 INFO - 'USER': 'cltbld', 16:37:49 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', 16:37:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:37:49 INFO - '_': '/tools/buildbot/bin/python'} 16:37:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:37:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:37:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 16:37:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 16:37:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 16:37:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 16:37:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 16:37:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 16:37:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 16:37:49 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 16:37:49 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:37:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 16:37:49 INFO - Cleaning up... 16:37:49 INFO - Return code: 0 16:37:49 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:37:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:37:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:37:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff727e1ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xec78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf94410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1023160>, '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 0x1024060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10244f0>, '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': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', '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 16:37:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 16:37:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 16:37:49 INFO - Using env: {'DISPLAY': ':0', 16:37:49 INFO - 'HOME': '/home/cltbld', 16:37:49 INFO - 'LANG': 'en_US.UTF-8', 16:37:49 INFO - 'LANGUAGE': 'en_US:en', 16:37:49 INFO - 'LOGNAME': 'cltbld', 16:37:49 INFO - 'MAIL': '/var/mail/cltbld', 16:37:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:37:49 INFO - 'MOZ_NO_REMOTE': '1', 16:37:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:37:49 INFO - 'NO_EM_RESTART': '1', 16:37:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:37:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:37:49 INFO - 'PWD': '/builds/slave/test', 16:37:49 INFO - 'SHELL': '/bin/bash', 16:37:49 INFO - 'SHLVL': '1', 16:37:49 INFO - 'TERM': 'linux', 16:37:49 INFO - 'TMOUT': '86400', 16:37:49 INFO - 'USER': 'cltbld', 16:37:49 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', 16:37:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:37:49 INFO - '_': '/tools/buildbot/bin/python'} 16:37:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:37:50 INFO - Downloading/unpacking jsonschema 16:37:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:52 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:37:52 INFO - Downloading/unpacking functools32 (from jsonschema) 16:37:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:52 INFO - Downloading functools32-3.2.3-2.tar.gz 16:37:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 16:37:52 INFO - warning: no files found matching '*.txt' 16:37:52 INFO - no previously-included directories found matching 'build' 16:37:52 INFO - no previously-included directories found matching 'dist' 16:37:52 INFO - no previously-included directories found matching '.git*' 16:37:52 INFO - Installing collected packages: jsonschema, functools32 16:37:52 INFO - Running setup.py install for functools32 16:37:52 INFO - warning: no files found matching '*.txt' 16:37:52 INFO - no previously-included directories found matching 'build' 16:37:52 INFO - no previously-included directories found matching 'dist' 16:37:52 INFO - no previously-included directories found matching '.git*' 16:37:52 INFO - Successfully installed jsonschema functools32 16:37:52 INFO - Cleaning up... 16:37:52 INFO - Return code: 0 16:37:52 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 16:37:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:37:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:37:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:37:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:37:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff727e1ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xec78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf94410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1023160>, '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 0x1024060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10244f0>, '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': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', '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 16:37:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 16:37:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 16:37:52 INFO - Using env: {'DISPLAY': ':0', 16:37:52 INFO - 'HOME': '/home/cltbld', 16:37:52 INFO - 'LANG': 'en_US.UTF-8', 16:37:52 INFO - 'LANGUAGE': 'en_US:en', 16:37:52 INFO - 'LOGNAME': 'cltbld', 16:37:52 INFO - 'MAIL': '/var/mail/cltbld', 16:37:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:37:52 INFO - 'MOZ_NO_REMOTE': '1', 16:37:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:37:52 INFO - 'NO_EM_RESTART': '1', 16:37:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:37:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:37:52 INFO - 'PWD': '/builds/slave/test', 16:37:52 INFO - 'SHELL': '/bin/bash', 16:37:52 INFO - 'SHLVL': '1', 16:37:52 INFO - 'TERM': 'linux', 16:37:52 INFO - 'TMOUT': '86400', 16:37:52 INFO - 'USER': 'cltbld', 16:37:52 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', 16:37:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:37:52 INFO - '_': '/tools/buildbot/bin/python'} 16:37:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:37:52 INFO - Downloading/unpacking flake8 16:37:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:54 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 16:37:54 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 16:37:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:54 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 16:37:54 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 16:37:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:37:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:37:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:37:55 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 16:37:55 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 16:37:55 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 16:37:55 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 16:37:55 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 16:37:55 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 16:37:55 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 16:37:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 16:37:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 16:37:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 16:37:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 16:37:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 16:37:55 INFO - no previously-included directories found matching 'docs/_build' 16:37:55 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 16:37:55 INFO - Running setup.py install for pep8 16:37:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 16:37:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 16:37:55 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 16:37:55 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 16:37:55 INFO - no previously-included directories found matching 'docs/_build' 16:37:55 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 16:37:55 INFO - Successfully installed flake8 mccabe pyflakes pep8 16:37:55 INFO - Cleaning up... 16:37:55 INFO - Return code: 0 16:37:55 INFO - Running post-action listener: _resource_record_post_action 16:37:55 INFO - Running post-action listener: _start_resource_monitoring 16:37:55 INFO - Starting resource monitoring. 16:37:55 INFO - ##### 16:37:55 INFO - ##### Running install step. 16:37:55 INFO - ##### 16:37:55 INFO - Running pre-action listener: _resource_record_pre_action 16:37:55 INFO - Running main action method: install 16:37:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:37:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:37:55 INFO - Reading from file tmpfile_stdout 16:37:55 INFO - Detecting whether we're running mozinstall >=1.0... 16:37:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:37:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:37:56 INFO - Reading from file tmpfile_stdout 16:37:56 INFO - Output received: 16:37:56 INFO - Usage: mozinstall [options] installer 16:37:56 INFO - Options: 16:37:56 INFO - -h, --help show this help message and exit 16:37:56 INFO - -d DEST, --destination=DEST 16:37:56 INFO - Directory to install application into. [default: 16:37:56 INFO - "/builds/slave/test"] 16:37:56 INFO - --app=APP Application being installed. [default: firefox] 16:37:56 INFO - mkdir: /builds/slave/test/build/application 16:37:56 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 16:37:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 16:38:08 INFO - Reading from file tmpfile_stdout 16:38:08 INFO - Output received: 16:38:08 INFO - /builds/slave/test/build/application/firefox/firefox 16:38:08 INFO - Running post-action listener: _resource_record_post_action 16:38:08 INFO - ##### 16:38:08 INFO - ##### Running run-tests step. 16:38:08 INFO - ##### 16:38:08 INFO - Running pre-action listener: _resource_record_pre_action 16:38:08 INFO - Running main action method: run_tests 16:38:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:38:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:38:08 INFO - Python 2.7.3 16:38:08 INFO - Return code: 0 16:38:08 INFO - grabbing minidump binary from tooltool 16:38: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')]} 16:38:08 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1023160>, '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 0x1024060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10244f0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:38:08 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 16:38:08 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 16:38:08 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:38:08 INFO - Return code: 0 16:38:08 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:38:08 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:38:08 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:38:08 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:38:08 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:38:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 16:38:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 16:38:09 INFO - Return code: 0 16:38:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-045', '--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 16:38:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-045 --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 16:38:09 INFO - Using env: {'DISPLAY': ':0', 16:38:09 INFO - 'HOME': '/home/cltbld', 16:38:09 INFO - 'LANG': 'en_US.UTF-8', 16:38:09 INFO - 'LANGUAGE': 'en_US:en', 16:38:09 INFO - 'LOGNAME': 'cltbld', 16:38:09 INFO - 'MAIL': '/var/mail/cltbld', 16:38:09 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:38:09 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:38:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:38:09 INFO - 'MOZ_NO_REMOTE': '1', 16:38:09 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:38:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:38:09 INFO - 'NO_EM_RESTART': '1', 16:38:09 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:38:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:38:09 INFO - 'PWD': '/builds/slave/test', 16:38:09 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:38:09 INFO - 'SHELL': '/bin/bash', 16:38:09 INFO - 'SHLVL': '1', 16:38:09 INFO - 'TERM': 'linux', 16:38:09 INFO - 'TMOUT': '86400', 16:38:09 INFO - 'USER': 'cltbld', 16:38:09 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1464650960.296021-1071286981', 16:38:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:38:09 INFO - '_': '/tools/buildbot/bin/python'} 16:38:09 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-045', '--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 16:38:10 INFO - mozversion application_buildid: 20160526140250 16:38:10 INFO - mozversion application_changeset: 2ee4473c729acb2ba7dc723e7affe79ce14bff85 16:38:10 INFO - mozversion application_display_name: Firefox 16:38:10 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:38:10 INFO - mozversion application_name: Firefox 16:38:10 INFO - mozversion application_remotingname: firefox 16:38:10 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 16:38:10 INFO - mozversion application_vendor: Mozilla 16:38:10 INFO - mozversion application_version: 47.0 16:38:10 INFO - mozversion platform_buildid: 20160526140250 16:38:10 INFO - mozversion platform_changeset: 2ee4473c729acb2ba7dc723e7affe79ce14bff85 16:38:10 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 16:38:10 INFO - mozversion platform_version: 47.0 16:38:10 INFO - using testdate: 1464651490 16:38:10 INFO - actual date: 1464651490 16:38:10 INFO - starting webserver on 'localhost:46387' 16:38:10 INFO - SUITE-START | Running 2 tests 16:38:10 INFO - TEST-START | dromaeo_css 16:38:10 INFO - operating with platform_type : linux_ 16:38:10 INFO - Initialising browser for dromaeo_css test... 16:38:10 INFO - TEST-INFO | started process 14742 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdY9H3A/profile http://localhost:46387/getInfo.html) 16:38:13 INFO - PROCESS | 14742 | 16:38:13 INFO - PROCESS | 14742 | (process:14819): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:38:14 INFO - PROCESS | 14742 | __metrics Screen width/height:1600/1200 16:38:14 INFO - PROCESS | 14742 | colorDepth:24 16:38:14 INFO - PROCESS | 14742 | Browser inner width/height: 1024/697 16:38:14 INFO - PROCESS | 14742 | __metrics 16:38:15 ERROR - PROCESS | 14742 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2844: TypeError: this.tabs is undefined 16:38:16 INFO - TEST-INFO | 14742: exit 0 16:38:16 INFO - Browser initialized. 16:38:16 INFO - Running cycle 1/1 for dromaeo_css test... 16:38:16 INFO - TEST-INFO | started process 14869 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdY9H3A/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:38:18 INFO - PROCESS | 14869 | 16:38:18 INFO - PROCESS | 14869 | (process:14938): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:38:28 INFO - PROCESS | 14869 | RSS: Main: 149766144 16:38:28 INFO - PROCESS | 14869 | 16:39:17 INFO - PROCESS | 14869 | 1464651557749 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] 16:41:25 INFO - PROCESS | 14869 | Cycle 1(1): loaded http://localhost:46387/tests/dromaeo/cssquery-dojo.html (next: http://localhost:46387/tests/dromaeo/cssquery-ext.html) 16:41:26 INFO - PROCESS | 14869 | RSS: Main: 152772608 16:41:26 INFO - PROCESS | 14869 | 16:44:28 INFO - PROCESS | 14869 | Cycle 1(1): loaded http://localhost:46387/tests/dromaeo/cssquery-ext.html (next: http://localhost:46387/tests/dromaeo/cssquery-jquery.html) 16:44:28 INFO - PROCESS | 14869 | RSS: Main: 152150016 16:44:28 INFO - PROCESS | 14869 | 16:47:30 INFO - PROCESS | 14869 | Cycle 1(1): loaded http://localhost:46387/tests/dromaeo/cssquery-jquery.html (next: http://localhost:46387/tests/dromaeo/cssquery-mootools.html) 16:47:31 INFO - PROCESS | 14869 | RSS: Main: 151416832 16:47:31 INFO - PROCESS | 14869 | 16:50:32 INFO - PROCESS | 14869 | Cycle 1(1): loaded http://localhost:46387/tests/dromaeo/cssquery-mootools.html (next: http://localhost:46387/tests/dromaeo/cssquery-prototype.html) 16:50:33 INFO - PROCESS | 14869 | RSS: Main: 152637440 16:50:33 INFO - PROCESS | 14869 | 16:53:35 INFO - PROCESS | 14869 | Cycle 1(1): loaded http://localhost:46387/tests/dromaeo/cssquery-prototype.html (next: http://localhost:46387/tests/dromaeo/cssquery-yui.html) 16:53:36 INFO - PROCESS | 14869 | RSS: Main: 151248896 16:53:36 INFO - PROCESS | 14869 | 16:56:38 INFO - PROCESS | 14869 | Cycle 1(1): loaded http://localhost:46387/tests/dromaeo/cssquery-yui.html (next: http://localhost:46387/tests/dromaeo/cssquery-dojo.html) 16:56:38 INFO - PROCESS | 14869 | RSS: Main: 155721728 16:56:38 INFO - PROCESS | 14869 | 16:56:38 INFO - PROCESS | 14869 | __start_tp_report 16:56:38 INFO - PROCESS | 14869 | _x_x_mozilla_page_load 16:56:38 INFO - PROCESS | 14869 | _x_x_mozilla_page_load_details 16:56:38 INFO - PROCESS | 14869 | |i|pagename|runs| 16:56:38 INFO - PROCESS | 14869 | |0;dojo.html;3314.7016768490835;3380.7802492837973;3403.710684591813;3428.2115113523887;3435.1412146963257;5409.134538473835;5433.049216387127;5437.04851650961;5448.346198456181;5450.182472629102;5429.212764149196;5433.8369848904495;5443.428440013801;5459.563234941205;5464.6994415307145;4927.310176575283;4971.005798840229;5021.774020169083;5037.949620503803;5050.242463630448;4932.728699921503;5043.873903152432;5053.4946505349535;5058.494150584949;5075.264086707425;5016.924746128811;5050.747462626872;5054.166062599685;5147.794088236466;5148.510891465305;5059.974700126494;5080.237964305384;5082;5090.363704536951;5122.026814905156;4905.264210368473;4914.189158788796;5046.1169295373165;5064.772085256172;5067.619928505377;5255.343082114736;5304.310439642822;5307.761150748187;5316.787328506855;5319.9202011969855;5890.528757699374;5938.257717785277;5943.643381397087;5944.078667806497;5945.4946329562035;5925.762969481216;5981.132735753335;5988.041913293896;6007.128966299906;6016.608920420159;5571.415001424833;5619.6066275360745;5628.0713682242385;5629.099344104964;5631.63394379364;5870.14882841994;6114.571979961449;6142.938570614326;6147.231596050494;6155.353687862799;5823.679697616672;5885.646861188342;5894.17481552583;5894.557908156819;5896.027155519377;5987.251593550806;6010.489108425745;6013.368596297413;6014.0377539593455;6018.548608854266;5705.343885453143;5802.65184088956;5957.791477298274;5978.611390259619;5982.341942386334;5829;5881.941180588139;5888.646681199141;5896.941030589725;5921.792737254262;4480.7535585542455;4481.462224533077;4489.191945449785;4495.57292057254;4525.275955847049;3952.7628342299554;3998.540167880673;4033.394990751352;4065.79671016448;4079.224947260011;5660.801871934463;5701.372848986608;5756.194132821408;5769.0192667246665;5769.134629805562;6009.549283803733;6015.398460154037;6018.307894592178;6028.457438830526;6029.487493563009;5657.405972372924;5750.6262092963825;5781.421857814269;5823.388544202798;5835.037218858925;5165.896682066337;5174.6377753557645;5181.326427564468;5204.687718736888;5219.295395121686;6220.626762394271;6233.2208473940755;6283.622982620966;6286.465650419674;6307.463865571478;5896;5976.581639285208;6008.429199226067;6028.306744724413;6061.181740464981;6222.0355844844125;6228.501719862309;6244.968775156095;6247.812565623039;6262;5889.734961926809;5902.7343769531335;5903.75698163677;5916.26046744157;5938.940610593839;5849.912251316148;5912.645241285537;5959.1657167995645;6022.156898034366;6043.395660433922;5787.160861674949;5789.363170051207;5792.478676919098;5792.681402522733;5801.767929282782;5712.485876271156;5799.594028418139;5803.680797556175;5808.041673123887;5812.924608947358;5459.426760190282;5581.776728930798;5610.214569960291;5632.605717599892;5638.85902852432;5796.82609521715;5805.361410244954;5826.82519524415;5827.94172058274;5844.883102337844;5550.888982220414;5685.090385538294;5688.374278829243;5712.400197979152;5738.942610573841 16:56:38 INFO - PROCESS | 14869 | |1;ext.html;506.1724081127356;522.062897099706;534.8475684429939;555.0924238869449;578.9838832848351;31398.84300578497;38986.220275594475;39634.60365396345;40037;40084.1983160337;43228.35157472632;43427.78286108573;43733.7813310933;43923.78038109813;44015.11969760611;8822.029576746569;9034.638614455414;9036.412633178856;9050.09499050093;9050.411723237969;8784.736457906272;8950.462972221654;8951.95524022379;8962.37263391563;8964.372493925428;9071.682491112811;9127.178553930145;9149.771255718593;9152.313576481758;9163.404378715362;9187;9252.259819214447;9256;9267.490288034156;9304.860427093565;9042.140996605312;9169;9176.357654964155;9197;9199.678011269574;43343.13313733708;43723;43808.342874856906;43898;44164.77917610391;3192.4732419150814;3319.6016478022793;3353.3460975109865;3581.9641803582153;3879.8448062077764;33109.66890331114;33129;33348.83325583381;33787.986360409224;34112.65887341144;4264.317709166518;4269.850555230552;4292.484901811771;4301.268784306675;4333.674974376903;291958;292072;292301.99999999785;293601;294967;46223.5377646226;65842;65946;66054.33945660578;66361.6681916597;44837.327440088426;44859.32711009338;45057.54942450599;45073.54926450693;45279.54720452753;16748.497545073667;17018.914905425394;17037.14814259282;17076.487705368858;17079.914600426917;13770.311484425738;13791.51729689456;13810.240436775874;13818.239996800272;13870.306484675726;15343.923280383528;15366;16004.359825607078;16119.355225791072;16139.870209085486;5938;5956.493698035629;5958.186760473301;6042.546808989343;6179.567430279927;1048.7483004079118;1085.8544235831116;1116.9273997190157;1139.789139009286;1181.167277069664;30355.392892142034;30799;31309.373812524078;31426.37147257042;31555;1036.6889933020063;1065.648336049102;1082.5994382078525;1106.4578356605366;1184.8815118488083;15844.52466426009;15954.76067858983;16025.599360016093;16145.112018838841;16368.263428145761;367814;804919;807053;811371;813217;62188.68905655443;62691.373086269465;62943;63021;63145.36854631395;1473.366452425446;1481.799957005812;1494.790729297921;1511.5843143135726;1540.776587394844;31710;32175;32468.67531324751;32622.67377326291;33109.83445082855;50818.49181508285;51421;51558.48441515687;51725;51969.740151299;315621;317347;317698;319243;320287;34905.47641785324;35209.47185792266;35329.47005794864;35649.643503564635;36167.81916090403;47440.52559474361;48478.757606211744;48509.75745121252;48618.270725939845;48741.5125848737;39094.609053909095;40676.186476269715;41154;41768.58231417647;41916.161676766904;40082.59917400789;40101.598984010954;40307.79846100751;40664.79667601643;40991.590084098774;38982.22035559216;40389.59610403976;40745;41215;41687.37468938029;35725.821370892976;35778;36183.45724814183;37098.8145059273;38420;27193.45613087767;27868.721312786613;27897.860510697315;27915.581266280617;28045.439091218468 16:56:38 INFO - PROCESS | 14869 | |2;jquery.html;361.08284956211224;364.5242957939889;368.9022409061598;373.9270842185775;377.73747245664276;17930.37243696469;18809;20372.286969956018;20434.182632694694;20451.386458406236;17155.399561015336;18363.173657185424;18889.811101888976;18948;18955.431337059876;5487.588430867681;5704.942950570483;5730.942690573103;5739.598228124033;5767.711614419283;5278.419373868871;5492.588055895823;5497.725113744316;5510.862228444281;5587.245721827542;5428.050091234038;5468.562514998791;5501.367342755574;5520.254765606632;6332.620042797447;6133.29467111279;6160.1991741073825;6182.072689096626;6235.625862448245;6250.4374606285655;5167.715775632339;5391.649542779707;5569;5571.164325351229;5582.385937546866;13960.86039139616;13978.860211397858;14192.716145677132;14204.147751134966;20534.58930821375;2085.1882986713936;2125.0968338456096;2152.2897443843494;2247.1797793805144;2457.3856535866034;9869.950650246774;10086.596536138546;10290.43402612856;10514.158867290598;10570;1894.1287007976348;1903.4670292318174;1911.340587497325;1950.7073938909136;2003.1186278037762;62418.687906560175;64406.67796661033;65272;65292.36769080764;66088.3391166087;10239.948800255952;10409.375437473776;10489.947550262199;10748.946255268673;10843.67468975932;14953.40186392532;15047.172405517802;15091.773623395658;15098.773518397233;15157.924210378878;8321.500709957421;8580.313574914117;8598.484090954562;8601.698940537051;8607.956960215159;8352.540610266493;8468.195521425454;8486.787830304293;8490.066092729794;8535.615897284637;4294.7852607369505;4738.241881298975;4771.5467030632035;4784.832530861473;4864.419063804277;1919.5872887329292;1978.0703069557285;1980.4454752669276;1982.930597429083;2031.6444622191057;962.0908241711516;1017.4810846468206;1053.1785207538132;1135.1316243074054;1160.930344179352;17602.647947040987;18058.548536286435;18183.181756820974;18353.3576324828;18756.906215468836;1015.9695209143738;1040.573364920379;1045.2839804733783;1079.96220132295;1089.2375337263948;10291.433971131659;10574.629887953884;10601.787964240671;10604.575816967235;10632.202584806171;456499;456984;458120;460974;462646;77051;80262.19737802664;80464.59767701125;80816;81012.59493702494;1084.6366467233408;1087.7008822573855;1090.650991682654;1093.6445655162104;1105.2760441910561;16151.596210094842;16249.59376015609;16432.178391080637;16467.83532164663;16708.58228544296;32734;33082.66917330796;34191.31617367589;34548.82725586356;35629.109272268404;45188;48169;48852.755736221094;48996.5100348992;49312.26031609457;8648.56757162152;8757.16562874371;8765.430247033923;8795.428297160664;8829.38194326391;9005.909940900507;10031.54858031405;13229.470821167046;13295;13506.459741610226;11325.15061370417;11472.483738231967;11484.94257528707;11498.712532186428;11520.769584608428;11314.943425282821;11478.196526243082;11620.477078531656;11629.953304202663;11686.883131168579;11299.774004519699;11562;11691;11772.705682357668;11818;7890.816377543414;8139.4709343892455;8477.95761021191;8741.388102832741;8796.516191609522;11540.596079137189;11576.189666723585;11604.825927610924;11654.41727913584;11806.586769463027 16:56:38 INFO - PROCESS | 14869 | |3;mootools.html;1559.524345074752;1579.4550879946419;1829.698099813531;1908.7518622579062;1963.2932144427994;7375.8156046098875;8043.91956080439;8106.351491880643;8255.91744082559;8256.999999999993;8187.26314631683;8231.42380033398;8237.752867413972;8299.709510167146;8359.791005224857;2457.176845756669;2475.962860557093;2481.789047930928;2483.987580062097;2498.962515562268;2399.6280576510667;2453.86503742295;2465;2470.7158676752224;2482.888270027844;2446.425090103824;2470.938226544342;2494.1769216158623;2499.450120973383;2505.035561308891;2368.97631023691;2381.833271670984;2390.4501964548076;2410.1323523531514;2422.5760491913934;2475.1460746042585;2499.687539057618;2505.6742623458836;2511.1336588876807;2513.308840068996;8624.956875215585;8664;8668.349873759431;8693.5218562979;8708.25979791712;5323.22813192085;5409.540189083893;5458.699771512565;5459.044667183227;5482.506574408322;3281.392942305681;3292.3909076820864;3310.2717402171484;3358.546596209505;3388.373150967079;1015.2537884654773;1020.1277907389224;1068.1027936533349;1072.463768115942;1077.095239998405;11006.174536909684;11016.559337626486;11062.834057489144;11063;11088.55645774168;4661.137689527381;4798.95201047985;4801.327814106028;4811.975940120277;4823.300621409876;10097.949510252402;10150.543225554868;10153.187744980383;10167.4916254187;10171;5302.840914772563;5421.972890135524;5429.267048948342;5434.864128396822;5465.234867118606;4157.958420415817;4577.816887324537;4591.77041147948;4704.1062198182235;4861.611071114302;3850.96149038506;3901.395283731026;3912.3349030664854;3915.275674000319;3932.528096628366;1293.32100647161;1300.7983762516826;1304.4456106154846;1305.47128412991;1316.3089378076586;1047;1054.0776820282254;1061.570064124031;1421.1118051217989;1463.6999415120088;7848.332891704269;7911.802204944807;7929.167437419103;8112;8155.306798922039;1181.710480932177;1192.8807119288;1218.5308656167263;1222.0468034932767;1232.4269214814974;6241.625502469867;6275.529335299871;6285.622862628257;6306.306306306303;6341.048842673636;10446.843297350546;10803.13574914005;10832.67501974942;10966.342019478856;10993.780124397626;10358.119559837498;10522.684319470429;10602.787944241072;10725.624603138853;10746.623868164734;7688.654010569538;7779.7666070017995;7826.7651970440975;7877.606119693993;7906.486078404885;7625.885611715939;7638.15980242184;7696.8075798103255;7835.529868207926;7920.485168464032;9120.087991200828;9129.634814607341;9210.95394523023;9229.307801915018;9394.624215031323;9302.069793020644;9330.346875718635;9426.905730942603;9567.37812042215;9568.043195680377;7021.3329733677265;7164.781987062108;7177.1746249182015;7300.12398512182;7393.408527317694;7968.6414111363965;7973.681052757825;7997;7997.400194985516;8008.479448835807;7313.490993016326;7532.54804711719;7564.962175189089;7625.351845093007;7627.580483073484;7339.889901651586;7346.77959661211;7404.666789994355;7419.369353605004;7474.103107627119;7678.5392876427595;7698.769036928901;7723.497972631761;7731.613419329124;7744.845103097794;7024.438044956493;7076.22161562238;7103.502754807114;7126.465515086493;7131.144262688511;7040.049593304839;7060.1880783708475;7070.36366726997;7085.397741192057;7124.608146551782 16:56:38 INFO - PROCESS | 14869 | |4;prototype.html;325.1886543075028;329.7971747375364;331.9883804066858;336.86357025404686;337.7652531490613;6275.6548389838545;6321.6523091229965;6323.05154226865;6324.209473815778;6325.968370158149;6248.094026366174;6252.155958945541;6264.123022776804;6277.780277690282;6284.245890493147;4601.3558101865765;4740.454847692507;4766.142094423002;4782.187028205213;4800.735959522233;4681.578657920786;4739.289106633998;4754.833580824672;4758.357621721076;4762.190427627294;4682.7892744826395;4704.0356726870905;4704.506026867181;4708.623310135198;4715.363425937506;4712.3873896393425;4717.433907931036;4729.314249433847;4730.8344207952905;4733.313669517918;4095.28332541804;4109.219248342805;4111.054457474767;4111.48606424197;4112.444819949298;5885.61743486672;5886.146508756249;5891.734871930774;5892.322382925932;5907.172995780594;5305.522502974713;5435.157550579627;5458.9454105458835;5506.03644362235;5514.310711161105;6544.051112588696;6575.408213260829;6631.204255489324;6667.599944003376;6679.432248258904;4510.797014134372;4530.77346132692;4532;4540.250858608326;4548.704334218299;6909.067275917737;6928;6972.825679358006;6990.54561453509;6996;4630.467496237909;4639.489656137822;4675.18184317743;4685.554872287127;4696.436427628638;4607.35497030416;4712.481627021025;4724.929126063112;4737.620990320766;4756.809727610926;5496.395396506381;5551.7779288828;5552.278203833475;5554;5560.499555040065;6779.49153813466;6782;6789.1852977643;6840.897386539206;6879.965600171967;1666.6666666666472;1695.1439523040785;1700.948971530856;1701.3960044184137;1704.113860792381;1060.437967877011;1088.357868857362;1088.684281558355;1092.9289596176222;1108.4402376799665;6634.734610615521;6639.601623902581;6656.267810540837;6691.1636045494315;6693.631850248283;6915.688794004282;6937.057623865326;6938.479614028968;6943.444524438033;6956.860862782817;6347.5556711029785;6439.967800160969;6562.80311590653;6606.8348291293105;6615.305392933673;3776.3957766757735;3808.1622043150464;3808.9809550952623;3814.8664796731982;3817.6945844332386;7404.1855395906405;7409.666565004588;7410.258974102547;7413.962930185315;7423.48035637511;7180.31786980236;7190.604516751629;7229.783106506813;7251.1661158966335;7261.164966028869;7090.397316228178;7323.231060738653;7331.413486921034;7332.96333518329;7401.703931842773;7014.614196219257;7027.332403421667;7028.472864535078;7031.613261270679;7048.859022819617;6927.653617319013;6943.40981016599;6945.965270173617;6959.373656370951;6972.058772065706;7395.926040739739;7399.8150046249275;7400.444966627417;7405.666744996381;7422.29086383477;4714.457837348748;4847.733374664427;4871.561559459666;4897.0450762101045;4947.678400903929;6923.7576684817805;6971.337722916315;6979.406750426067;6980.546264492792;7043.013978043181;6740.359665831738;6742.25835158142;6745.4266387355665;6748.966255168692;6782.253952065367;6793.388595026471;6829.2487826338065;6835.521513494206;6837.213720422215;6842.042114104129;6409.871802563829;6606.735730570724;6672.499562532927;6688;6723.1259936209935;6764.695588698422;6764.93235067643;6770.52606317553;6804.931950680628;6854.417374523221;6630.668466576748;6637.933620663925;6676.9332306676315;6695.363940425652;6722 16:56:38 INFO - PROCESS | 14869 | |5;yui.html;884.6742609490861;893.044442446582;894.2488309819751;902.1474706402444;915.9587818548167;14794;14989.850101498996;15005.924970375147;15011.249437528135;15043.623909402271;14062.929685351559;14076.788848167285;14202.78695819561;14237.71524569508;14241.074330168532;757.5984728094119;925.2967744514184;928.642472648032;929.0430856218106;941.1482608239554;935.6117211357313;939.1500691873831;940.9059094090604;943.2548286853378;948.8576713492997;996.3324572536382;997.4813097189457;998.1066945084145;999.6101520407047;1008.8890222075565;978.872746542952;984.7931934293807;985.7584891701507;991.8561808537721;1000.8148492528869;735.3639102176633;738.4018944654847;739.3863093632326;739.548875186136;743.1194035068407;14263.429462821474;14292.928535357256;14300.499482518062;14308.92845535776;14350.569482915425;13913.443462261599;14012.089214201043;14117.576472705836;14137.646558836008;14147.504837330747;11449.656510304705;11551.53793848245;11554.364509951949;11587.304761714324;11717.179797414185;3903.4535165076913;3956.188981258835;4012.9398059029136;4026.053877338823;4040.070783719761;47114.52885471136;47144.29283560715;47160;47162;47518;10513.158947284199;10562.524686389132;10593.470326483644;10736.141108711285;10979.505922233358;19124.33064842724;19128.61742765137;19340.613187736166;19367.709484357747;19871.205151794056;8280.83438331242;8282.254597086292;8330.375221858385;8364.121767214476;8369.3304535637;4053.1893621275863;4345.109252603209;4361.433013708198;4389.209942210433;4389.780510974439;3313.784604000732;3351.312980838922;3352.6479719629574;3356.060303115132;3358.1268870093463;620.2092332276294;621.5183232994466;627.9120923070774;628.5914155798768;633.4457349818908;592.4874983139554;635.2440595691113;679.9490038247151;685.0614657918584;693.9167299924042;8012.0786109596975;8090.797730056678;8186.2632363087605;8596.570171491401;8653.913460865437;574.7959474386616;610.3835126522245;651.9413252807175;661.7452280871898;681.621699956519;3878.4764056852528;4070.898227544276;4110.568390319033;4145.854895078658;4153.460050193456;54116.72941635267;54729;54797;54841.72579137079;54861.725691371284;48859.267110993365;49503;50465.49534504682;50668.239976400386;51556.74221628868;46271.07457850824;46491.070178596914;46567.53432465632;47072.764636177286;47810.28284575734;7831.334336581454;7852.175521570153;7955.085165205844;7999.160088190656;8296.70961516344;34833;34915.65084349226;36145.457818133276;36340.27319453543;38634.42048369221;41950;42296.5770342305;42667.57332426636;42995.140097198506;43993.78003109964;12073.75852482963;12200.572979945659;12203.309035295024;12275.140740148105;12596.370181491073;12934.417951192407;13795.310234488035;13968.092074015156;14223.857761422667;14652.413903444169;11263.49314280843;11380.317180969168;11431.59989400367;11456.19806613529;11475.368854713071;11397.943010285228;11499.540018399504;11721.648350549498;11774.94112529432;11883;10806.567737290421;11376.317420954769;11391.715207119556;12397.75204495923;12708.809367859674;10578.629747959092;10620.937906209318;10705.518251678537;11090.889091108986;11349.4892729829;10044.347117437343;10047.296689231684;10215.642452514126;10314.801077383376;10321.63874264397 16:56:38 INFO - PROCESS | 14869 | __end_tp_report 16:56:38 INFO - PROCESS | 14869 | __start_cc_report 16:56:38 INFO - PROCESS | 14869 | _x_x_mozilla_cycle_collect,322 16:56:38 INFO - PROCESS | 14869 | __end_cc_report 16:56:38 INFO - PROCESS | 14869 | __startTimestamp1464652598531__endTimestamp 16:56:38 INFO - PROCESS | 14869 | 16:56:38 INFO - PROCESS | 14869 | ------- Summary: start ------- 16:56:38 INFO - PROCESS | 14869 | Number of tests: 6 16:56:38 INFO - PROCESS | 14869 | 16:56:38 INFO - PROCESS | 14869 | [#0] dojo.html Cycles:165 Average:5524.68 Median:5769.02 stddev:625.25 (10.8%) stddev-sans-first:602.65 16:56:38 INFO - PROCESS | 14869 | Values: 3314.7 3380.8 3403.7 3428.2 3435.1 5409.1 5433.0 5437.0 5448.3 5450.2 5429.2 5433.8 5443.4 5459.6 5464.7 4927.3 4971.0 5021.8 5037.9 5050.2 4932.7 5043.9 5053.5 5058.5 5075.3 5016.9 5050.7 5054.2 5147.8 5148.5 5060.0 5080.2 5082.0 5090.4 5122.0 4905.3 4914.2 5046.1 5064.8 5067.6 5255.3 5304.3 5307.8 5316.8 5319.9 5890.5 5938.3 5943.6 5944.1 5945.5 5925.8 5981.1 5988.0 6007.1 6016.6 5571.4 5619.6 5628.1 5629.1 5631.6 5870.1 6114.6 6142.9 6147.2 6155.4 5823.7 5885.6 5894.2 5894.6 5896.0 5987.3 6010.5 6013.4 6014.0 6018.5 5705.3 5802.7 5957.8 5978.6 5982.3 5829.0 5881.9 5888.6 5896.9 5921.8 4480.8 4481.5 4489.2 4495.6 4525.3 3952.8 3998.5 4033.4 4065.8 4079.2 5660.8 5701.4 5756.2 5769.0 5769.1 6009.5 6015.4 6018.3 6028.5 6029.5 5657.4 5750.6 5781.4 5823.4 5835.0 5165.9 5174.6 5181.3 5204.7 5219.3 6220.6 6233.2 6283.6 6286.5 6307.5 5896.0 5976.6 6008.4 6028.3 6061.2 6222.0 6228.5 6245.0 6247.8 6262.0 5889.7 5902.7 5903.8 5916.3 5938.9 5849.9 5912.6 5959.2 6022.2 6043.4 5787.2 5789.4 5792.5 5792.7 5801.8 5712.5 5799.6 5803.7 5808.0 5812.9 5459.4 5581.8 5610.2 5632.6 5638.9 5796.8 5805.4 5826.8 5827.9 5844.9 5550.9 5685.1 5688.4 5712.4 5738.9 16:56:38 INFO - PROCESS | 14869 | 16:56:38 INFO - PROCESS | 14869 | [#1] ext.html Cycles:180 Average:60336.87 Median:40348.70 stddev:133691.54 (331.3%) stddev-sans-first:133991.11 16:56:38 INFO - PROCESS | 14869 | Values: 506.2 522.1 534.8 555.1 579.0 31398.8 38986.2 39634.6 40037.0 40084.2 43228.4 43427.8 43733.8 43923.8 44015.1 8822.0 9034.6 9036.4 9050.1 9050.4 8784.7 8950.5 8952.0 8962.4 8964.4 9071.7 9127.2 9149.8 9152.3 9163.4 9187.0 9252.3 9256.0 9267.5 9304.9 9042.1 9169.0 9176.4 9197.0 9199.7 43343.1 43723.0 43808.3 43898.0 44164.8 3192.5 3319.6 3353.3 3582.0 3879.8 33109.7 33129.0 33348.8 33788.0 34112.7 4264.3 4269.9 4292.5 4301.3 4333.7 291958.0 292072.0 292302.0 293601.0 294967.0 46223.5 65842.0 65946.0 66054.3 66361.7 44837.3 44859.3 45057.5 45073.5 45279.5 16748.5 17018.9 17037.1 17076.5 17079.9 13770.3 13791.5 13810.2 13818.2 13870.3 15343.9 15366.0 16004.4 16119.4 16139.9 5938.0 5956.5 5958.2 6042.5 6179.6 1048.7 1085.9 1116.9 1139.8 1181.2 30355.4 30799.0 31309.4 31426.4 31555.0 1036.7 1065.6 1082.6 1106.5 1184.9 15844.5 15954.8 16025.6 16145.1 16368.3 367814.0 804919.0 807053.0 811371.0 813217.0 62188.7 62691.4 62943.0 63021.0 63145.4 1473.4 1481.8 1494.8 1511.6 1540.8 31710.0 32175.0 32468.7 32622.7 33109.8 50818.5 51421.0 51558.5 51725.0 51969.7 315621.0 317347.0 317698.0 319243.0 320287.0 34905.5 35209.5 35329.5 35649.6 36167.8 47440.5 48478.8 48509.8 48618.3 48741.5 39094.6 40676.2 41154.0 41768.6 41916.2 40082.6 40101.6 40307.8 40664.8 40991.6 38982.2 40389.6 40745.0 41215.0 41687.4 35725.8 35778.0 36183.5 37098.8 38420.0 27193.5 27868.7 27897.9 27915.6 28045.4 16:56:38 INFO - PROCESS | 14869 | 16:56:38 INFO - PROCESS | 14869 | [#2] jquery.html Cycles:180 Average:26538.12 Median:20492.99 stddev:75250.50 (367.2%) stddev-sans-first:75435.93 16:56:38 INFO - PROCESS | 14869 | Values: 361.1 364.5 368.9 373.9 377.7 17930.4 18809.0 20372.3 20434.2 20451.4 17155.4 18363.2 18889.8 18948.0 18955.4 5487.6 5704.9 5730.9 5739.6 5767.7 5278.4 5492.6 5497.7 5510.9 5587.2 5428.1 5468.6 5501.4 5520.3 6332.6 6133.3 6160.2 6182.1 6235.6 6250.4 5167.7 5391.6 5569.0 5571.2 5582.4 13960.9 13978.9 14192.7 14204.1 20534.6 2085.2 2125.1 2152.3 2247.2 2457.4 9870.0 10086.6 10290.4 10514.2 10570.0 1894.1 1903.5 1911.3 1950.7 2003.1 62418.7 64406.7 65272.0 65292.4 66088.3 10239.9 10409.4 10489.9 10748.9 10843.7 14953.4 15047.2 15091.8 15098.8 15157.9 8321.5 8580.3 8598.5 8601.7 8608.0 8352.5 8468.2 8486.8 8490.1 8535.6 4294.8 4738.2 4771.5 4784.8 4864.4 1919.6 1978.1 1980.4 1982.9 2031.6 962.1 1017.5 1053.2 1135.1 1160.9 17602.6 18058.5 18183.2 18353.4 18756.9 1016.0 1040.6 1045.3 1080.0 1089.2 10291.4 10574.6 10601.8 10604.6 10632.2 456499.0 456984.0 458120.0 460974.0 462646.0 77051.0 80262.2 80464.6 80816.0 81012.6 1084.6 1087.7 1090.7 1093.6 1105.3 16151.6 16249.6 16432.2 16467.8 16708.6 32734.0 33082.7 34191.3 34548.8 35629.1 45188.0 48169.0 48852.8 48996.5 49312.3 8648.6 8757.2 8765.4 8795.4 8829.4 9005.9 10031.5 13229.5 13295.0 13506.5 11325.2 11472.5 11484.9 11498.7 11520.8 11314.9 11478.2 11620.5 11630.0 11686.9 11299.8 11562.0 11691.0 11772.7 11818.0 7890.8 8139.5 8478.0 8741.4 8796.5 11540.6 11576.2 11604.8 11654.4 11806.6 16:56:38 INFO - PROCESS | 14869 | 16:56:38 INFO - PROCESS | 14869 | [#3] mootools.html Cycles:180 Average:5953.54 Median:5313.03 stddev:3080.57 (58.0%) stddev-sans-first:3071.50 16:56:38 INFO - PROCESS | 14869 | Values: 1559.5 1579.5 1829.7 1908.8 1963.3 7375.8 8043.9 8106.4 8255.9 8257.0 8187.3 8231.4 8237.8 8299.7 8359.8 2457.2 2476.0 2481.8 2484.0 2499.0 2399.6 2453.9 2465.0 2470.7 2482.9 2446.4 2470.9 2494.2 2499.5 2505.0 2369.0 2381.8 2390.5 2410.1 2422.6 2475.1 2499.7 2505.7 2511.1 2513.3 8625.0 8664.0 8668.3 8693.5 8708.3 5323.2 5409.5 5458.7 5459.0 5482.5 3281.4 3292.4 3310.3 3358.5 3388.4 1015.3 1020.1 1068.1 1072.5 1077.1 11006.2 11016.6 11062.8 11063.0 11088.6 4661.1 4799.0 4801.3 4812.0 4823.3 10097.9 10150.5 10153.2 10167.5 10171.0 5302.8 5422.0 5429.3 5434.9 5465.2 4158.0 4577.8 4591.8 4704.1 4861.6 3851.0 3901.4 3912.3 3915.3 3932.5 1293.3 1300.8 1304.4 1305.5 1316.3 1047.0 1054.1 1061.6 1421.1 1463.7 7848.3 7911.8 7929.2 8112.0 8155.3 1181.7 1192.9 1218.5 1222.0 1232.4 6241.6 6275.5 6285.6 6306.3 6341.0 10446.8 10803.1 10832.7 10966.3 10993.8 10358.1 10522.7 10602.8 10725.6 10746.6 7688.7 7779.8 7826.8 7877.6 7906.5 7625.9 7638.2 7696.8 7835.5 7920.5 9120.1 9129.6 9211.0 9229.3 9394.6 9302.1 9330.3 9426.9 9567.4 9568.0 7021.3 7164.8 7177.2 7300.1 7393.4 7968.6 7973.7 7997.0 7997.4 8008.5 7313.5 7532.5 7565.0 7625.4 7627.6 7339.9 7346.8 7404.7 7419.4 7474.1 7678.5 7698.8 7723.5 7731.6 7744.8 7024.4 7076.2 7103.5 7126.5 7131.1 7040.0 7060.2 7070.4 7085.4 7124.6 16:56:38 INFO - PROCESS | 14869 | 16:56:38 INFO - PROCESS | 14869 | [#4] prototype.html Cycles:180 Average:5628.35 Median:6378.71 stddev:1742.71 (27.3%) stddev-sans-first:1701.53 16:56:38 INFO - PROCESS | 14869 | Values: 325.2 329.8 332.0 336.9 337.8 6275.7 6321.7 6323.1 6324.2 6326.0 6248.1 6252.2 6264.1 6277.8 6284.2 4601.4 4740.5 4766.1 4782.2 4800.7 4681.6 4739.3 4754.8 4758.4 4762.2 4682.8 4704.0 4704.5 4708.6 4715.4 4712.4 4717.4 4729.3 4730.8 4733.3 4095.3 4109.2 4111.1 4111.5 4112.4 5885.6 5886.1 5891.7 5892.3 5907.2 5305.5 5435.2 5458.9 5506.0 5514.3 6544.1 6575.4 6631.2 6667.6 6679.4 4510.8 4530.8 4532.0 4540.3 4548.7 6909.1 6928.0 6972.8 6990.5 6996.0 4630.5 4639.5 4675.2 4685.6 4696.4 4607.4 4712.5 4724.9 4737.6 4756.8 5496.4 5551.8 5552.3 5554.0 5560.5 6779.5 6782.0 6789.2 6840.9 6880.0 1666.7 1695.1 1700.9 1701.4 1704.1 1060.4 1088.4 1088.7 1092.9 1108.4 6634.7 6639.6 6656.3 6691.2 6693.6 6915.7 6937.1 6938.5 6943.4 6956.9 6347.6 6440.0 6562.8 6606.8 6615.3 3776.4 3808.2 3809.0 3814.9 3817.7 7404.2 7409.7 7410.3 7414.0 7423.5 7180.3 7190.6 7229.8 7251.2 7261.2 7090.4 7323.2 7331.4 7333.0 7401.7 7014.6 7027.3 7028.5 7031.6 7048.9 6927.7 6943.4 6946.0 6959.4 6972.1 7395.9 7399.8 7400.4 7405.7 7422.3 4714.5 4847.7 4871.6 4897.0 4947.7 6923.8 6971.3 6979.4 6980.5 7043.0 6740.4 6742.3 6745.4 6749.0 6782.3 6793.4 6829.2 6835.5 6837.2 6842.0 6409.9 6606.7 6672.5 6688.0 6723.1 6764.7 6764.9 6770.5 6804.9 6854.4 6630.7 6637.9 6676.9 6695.4 6722.0 16:56:38 INFO - PROCESS | 14869 | 16:56:38 INFO - PROCESS | 14869 | [#5] yui.html Cycles:180 Average:14076.86 Median:4128.21 stddev:15529.87 (376.2%) stddev-sans-first:15541.83 16:56:38 INFO - PROCESS | 14869 | Values: 884.7 893.0 894.2 902.1 916.0 14794.0 14989.9 15005.9 15011.2 15043.6 14062.9 14076.8 14202.8 14237.7 14241.1 757.6 925.3 928.6 929.0 941.1 935.6 939.2 940.9 943.3 948.9 996.3 997.5 998.1 999.6 1008.9 978.9 984.8 985.8 991.9 1000.8 735.4 738.4 739.4 739.5 743.1 14263.4 14292.9 14300.5 14308.9 14350.6 13913.4 14012.1 14117.6 14137.6 14147.5 11449.7 11551.5 11554.4 11587.3 11717.2 3903.5 3956.2 4012.9 4026.1 4040.1 47114.5 47144.3 47160.0 47162.0 47518.0 10513.2 10562.5 10593.5 10736.1 10979.5 19124.3 19128.6 19340.6 19367.7 19871.2 8280.8 8282.3 8330.4 8364.1 8369.3 4053.2 4345.1 4361.4 4389.2 4389.8 3313.8 3351.3 3352.6 3356.1 3358.1 620.2 621.5 627.9 628.6 633.4 592.5 635.2 679.9 685.1 693.9 8012.1 8090.8 8186.3 8596.6 8653.9 574.8 610.4 651.9 661.7 681.6 3878.5 4070.9 4110.6 4145.9 4153.5 54116.7 54729.0 54797.0 54841.7 54861.7 48859.3 49503.0 50465.5 50668.2 51556.7 46271.1 46491.1 46567.5 47072.8 47810.3 7831.3 7852.2 7955.1 7999.2 8296.7 34833.0 34915.7 36145.5 36340.3 38634.4 41950.0 42296.6 42667.6 42995.1 43993.8 12073.8 12200.6 12203.3 12275.1 12596.4 12934.4 13795.3 13968.1 14223.9 14652.4 11263.5 11380.3 11431.6 11456.2 11475.4 11397.9 11499.5 11721.6 11774.9 11883.0 10806.6 11376.3 11391.7 12397.8 12708.8 10578.6 10620.9 10705.5 11090.9 11349.5 10044.3 10047.3 10215.6 10314.8 10321.6 16:56:38 INFO - PROCESS | 14869 | -------- Summary: end -------- 16:56:38 INFO - PROCESS | 14869 | 16:56:39 INFO - TEST-INFO | 14869: exit 0 16:56:39 INFO - TEST-OK | dromaeo_css | took 1109193ms 16:56:39 INFO - TEST-START | kraken 16:56:39 INFO - operating with platform_type : linux_ 16:56:39 INFO - Initialising browser for kraken test... 16:56:39 INFO - TEST-INFO | started process 15108 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpprL6Fo/profile http://localhost:46387/getInfo.html) 16:56:42 INFO - PROCESS | 15108 | 16:56:42 INFO - PROCESS | 15108 | (process:15183): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:56:43 INFO - PROCESS | 15108 | __metrics Screen width/height:1600/1200 16:56:43 INFO - PROCESS | 15108 | colorDepth:24 16:56:43 INFO - PROCESS | 15108 | Browser inner width/height: 1024/697 16:56:43 INFO - PROCESS | 15108 | __metrics 16:56:44 ERROR - PROCESS | 15108 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2844: TypeError: this.tabs is undefined 16:56:45 INFO - TEST-INFO | 15108: exit 0 16:56:45 INFO - Browser initialized. 16:56:45 INFO - Running cycle 1/1 for kraken test... 16:56:45 INFO - TEST-INFO | started process 15233 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpprL6Fo/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:56:47 INFO - PROCESS | 15233 | 16:56:47 INFO - PROCESS | 15233 | (process:15304): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:56:57 INFO - PROCESS | 15233 | RSS: Main: 149643264 16:56:57 INFO - PROCESS | 15233 | 16:56:59 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:46387/tests/kraken/driver.html?testName=audio-beat-detection) 16:57:00 INFO - PROCESS | 15233 | RSS: Main: 154202112 16:57:00 INFO - PROCESS | 15233 | 16:57:02 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:46387/tests/kraken/driver.html?testName=audio-dft) 16:57:03 INFO - PROCESS | 15233 | RSS: Main: 154431488 16:57:03 INFO - PROCESS | 15233 | 16:57:06 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:46387/tests/kraken/driver.html?testName=audio-fft) 16:57:06 INFO - PROCESS | 15233 | RSS: Main: 154849280 16:57:06 INFO - PROCESS | 15233 | 16:57:08 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:46387/tests/kraken/driver.html?testName=audio-oscillator) 16:57:09 INFO - PROCESS | 15233 | RSS: Main: 155295744 16:57:09 INFO - PROCESS | 15233 | 16:57:11 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:46387/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:57:12 INFO - PROCESS | 15233 | RSS: Main: 154890240 16:57:12 INFO - PROCESS | 15233 | 16:57:15 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:46387/tests/kraken/driver.html?testName=imaging-darkroom) 16:57:16 INFO - PROCESS | 15233 | RSS: Main: 155066368 16:57:16 INFO - PROCESS | 15233 | 16:57:19 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:46387/tests/kraken/driver.html?testName=imaging-desaturate) 16:57:20 INFO - PROCESS | 15233 | RSS: Main: 155344896 16:57:20 INFO - PROCESS | 15233 | 16:57:22 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:46387/tests/kraken/driver.html?testName=json-parse-financial) 16:57:23 INFO - PROCESS | 15233 | RSS: Main: 154894336 16:57:23 INFO - PROCESS | 15233 | 16:57:24 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:46387/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:57:25 INFO - PROCESS | 15233 | RSS: Main: 154918912 16:57:25 INFO - PROCESS | 15233 | 16:57:27 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:46387/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:57:27 INFO - PROCESS | 15233 | RSS: Main: 154935296 16:57:27 INFO - PROCESS | 15233 | 16:57:29 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:46387/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:57:30 INFO - PROCESS | 15233 | RSS: Main: 155217920 16:57:30 INFO - PROCESS | 15233 | 16:57:32 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:46387/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:57:33 INFO - PROCESS | 15233 | RSS: Main: 155340800 16:57:33 INFO - PROCESS | 15233 | 16:57:36 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:46387/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:57:36 INFO - PROCESS | 15233 | RSS: Main: 155291648 16:57:36 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | Cycle 1(1): loaded http://localhost:46387/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:46387/tests/kraken/driver.html?testName=ai-astar) 16:57:38 INFO - PROCESS | 15233 | RSS: Main: 157011968 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | __start_tp_report 16:57:38 INFO - PROCESS | 15233 | _x_x_mozilla_page_load 16:57:38 INFO - PROCESS | 15233 | _x_x_mozilla_page_load_details 16:57:38 INFO - PROCESS | 15233 | |i|pagename|runs| 16:57:38 INFO - PROCESS | 15233 | |0;ai-astar;111;112;106;110;113;111;105;112;113;111 16:57:38 INFO - PROCESS | 15233 | |1;audio-beat-detection;161;134;151;168;136;160;160;129;166;134 16:57:38 INFO - PROCESS | 15233 | |2;audio-dft;162;162;162;163;164;164;162;161;163;163 16:57:38 INFO - PROCESS | 15233 | |3;audio-fft;78;82;77;163;75;77;75;74;163;77 16:57:38 INFO - PROCESS | 15233 | |4;audio-oscillator;93;94;141;93;95;94;143;94;95;152 16:57:38 INFO - PROCESS | 15233 | |5;imaging-gaussian-blur;117;117;117;118;117;117;118;117;117;117 16:57:38 INFO - PROCESS | 15233 | |6;imaging-darkroom;146;146;147;146;147;147;148;147;147;146 16:57:38 INFO - PROCESS | 15233 | |7;imaging-desaturate;97;96;96;96;98;96;96;96;96;97 16:57:38 INFO - PROCESS | 15233 | |8;json-parse-financial;55;57;56;55;56;57;56;59;63;55 16:57:38 INFO - PROCESS | 15233 | |9;json-stringify-tinderbox;65;65;65;65;65;65;65;65;64;66 16:57:38 INFO - PROCESS | 15233 | |10;stanford-crypto-aes;80;81;80;80;80;80;80;80;80;83 16:57:38 INFO - PROCESS | 15233 | |11;stanford-crypto-ccm;119;114;115;118;125;122;117;114;114;116 16:57:38 INFO - PROCESS | 15233 | |12;stanford-crypto-pbkdf2;146;135;141;146;145;135;145;142;144;132 16:57:38 INFO - PROCESS | 15233 | |13;stanford-crypto-sha256-iterative;74;70;70;68;67;66;65;75;71;67 16:57:38 INFO - PROCESS | 15233 | __end_tp_report 16:57:38 INFO - PROCESS | 15233 | __start_cc_report 16:57:38 INFO - PROCESS | 15233 | _x_x_mozilla_cycle_collect,828 16:57:38 INFO - PROCESS | 15233 | __end_cc_report 16:57:38 INFO - PROCESS | 15233 | __startTimestamp1464652658598__endTimestamp 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | ------- Summary: start ------- 16:57:38 INFO - PROCESS | 15233 | Number of tests: 14 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#0] ai-astar Cycles:10 Average:110.40 Median:111.50 stddev:2.76 (2.5%) stddev-sans-first:2.92 16:57:38 INFO - PROCESS | 15233 | Values: 111.0 112.0 106.0 110.0 113.0 111.0 105.0 112.0 113.0 111.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#1] audio-beat-detection Cycles:10 Average:149.90 Median:160.00 stddev:15.10 (9.4%) stddev-sans-first:15.47 16:57:38 INFO - PROCESS | 15233 | Values: 161.0 134.0 151.0 168.0 136.0 160.0 160.0 129.0 166.0 134.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#2] audio-dft Cycles:10 Average:162.60 Median:163.00 stddev:0.97 (0.6%) stddev-sans-first:1.00 16:57:38 INFO - PROCESS | 15233 | Values: 162.0 162.0 162.0 163.0 164.0 164.0 162.0 161.0 163.0 163.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#3] audio-fft Cycles:10 Average:94.10 Median:77.00 stddev:36.38 (47.2%) stddev-sans-first:38.12 16:57:38 INFO - PROCESS | 15233 | Values: 78.0 82.0 77.0 163.0 75.0 77.0 75.0 74.0 163.0 77.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#4] audio-oscillator Cycles:10 Average:109.40 Median:94.00 stddev:24.96 (26.6%) stddev-sans-first:25.76 16:57:38 INFO - PROCESS | 15233 | Values: 93.0 94.0 141.0 93.0 95.0 94.0 143.0 94.0 95.0 152.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#5] imaging-gaussian-blur Cycles:10 Average:117.20 Median:117.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 16:57:38 INFO - PROCESS | 15233 | Values: 117.0 117.0 117.0 118.0 117.0 117.0 118.0 117.0 117.0 117.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#6] imaging-darkroom Cycles:10 Average:146.70 Median:147.00 stddev:0.67 (0.5%) stddev-sans-first:0.67 16:57:38 INFO - PROCESS | 15233 | Values: 146.0 146.0 147.0 146.0 147.0 147.0 148.0 147.0 147.0 146.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:96.00 stddev:0.70 (0.7%) stddev-sans-first:0.71 16:57:38 INFO - PROCESS | 15233 | Values: 97.0 96.0 96.0 96.0 98.0 96.0 96.0 96.0 96.0 97.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#8] json-parse-financial Cycles:10 Average:56.90 Median:56.50 stddev:2.47 (4.4%) stddev-sans-first:2.52 16:57:38 INFO - PROCESS | 15233 | Values: 55.0 57.0 56.0 55.0 56.0 57.0 56.0 59.0 63.0 55.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#9] json-stringify-tinderbox Cycles:10 Average:65.00 Median:65.00 stddev:0.47 (0.7%) stddev-sans-first:0.50 16:57:38 INFO - PROCESS | 15233 | Values: 65.0 65.0 65.0 65.0 65.0 65.0 65.0 65.0 64.0 66.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#10] stanford-crypto-aes Cycles:10 Average:80.40 Median:80.00 stddev:0.97 (1.2%) stddev-sans-first:1.01 16:57:38 INFO - PROCESS | 15233 | Values: 80.0 81.0 80.0 80.0 80.0 80.0 80.0 80.0 80.0 83.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#11] stanford-crypto-ccm Cycles:10 Average:117.40 Median:117.50 stddev:3.72 (3.2%) stddev-sans-first:3.90 16:57:38 INFO - PROCESS | 15233 | Values: 119.0 114.0 115.0 118.0 125.0 122.0 117.0 114.0 114.0 116.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:141.10 Median:144.50 stddev:5.22 (3.6%) stddev-sans-first:5.22 16:57:38 INFO - PROCESS | 15233 | Values: 146.0 135.0 141.0 146.0 145.0 135.0 145.0 142.0 144.0 132.0 16:57:38 INFO - PROCESS | 15233 | 16:57:38 INFO - PROCESS | 15233 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.30 Median:70.00 stddev:3.33 (4.8%) stddev-sans-first:3.07 16:57:38 INFO - PROCESS | 15233 | Values: 74.0 70.0 70.0 68.0 67.0 66.0 65.0 75.0 71.0 67.0 16:57:38 INFO - PROCESS | 15233 | -------- Summary: end -------- 16:57:38 INFO - PROCESS | 15233 | 16:57:39 INFO - TEST-INFO | 15233: exit 0 16:57:39 INFO - TEST-OK | kraken | took 60271ms 16:57:39 INFO - SUITE-END | took 1169s 16:57:39 INFO - Completed test suite (00:19:29) 16:57:39 INFO - javascript benchmark 16:57:39 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3314.7016768490835, 3380.7802492837973, 3403.710684591813, 3428.2115113523887, 3435.1412146963257, 5409.134538473835, 5433.049216387127, 5437.04851650961, 5448.346198456181, 5450.182472629102, 5429.212764149196, 5433.8369848904495, 5443.428440013801, 5459.563234941205, 5464.6994415307145, 4927.310176575283, 4971.005798840229, 5021.774020169083, 5037.949620503803, 5050.242463630448, 4932.728699921503, 5043.873903152432, 5053.4946505349535, 5058.494150584949, 5075.264086707425, 5016.924746128811, 5050.747462626872, 5054.166062599685, 5147.794088236466, 5148.510891465305, 5059.974700126494, 5080.237964305384, 5082.0, 5090.363704536951, 5122.026814905156, 4905.264210368473, 4914.189158788796, 5046.1169295373165, 5064.772085256172, 5067.619928505377, 5255.343082114736, 5304.310439642822, 5307.761150748187, 5316.787328506855, 5319.9202011969855, 5890.528757699374, 5938.257717785277, 5943.643381397087, 5944.078667806497, 5945.4946329562035, 5925.762969481216, 5981.132735753335, 5988.041913293896, 6007.128966299906, 6016.608920420159, 5571.415001424833, 5619.6066275360745, 5628.0713682242385, 5629.099344104964, 5631.63394379364, 5870.14882841994, 6114.571979961449, 6142.938570614326, 6147.231596050494, 6155.353687862799, 5823.679697616672, 5885.646861188342, 5894.17481552583, 5894.557908156819, 5896.027155519377, 5987.251593550806, 6010.489108425745, 6013.368596297413, 6014.0377539593455, 6018.548608854266, 5705.343885453143, 5802.65184088956, 5957.791477298274, 5978.611390259619, 5982.341942386334, 5829.0, 5881.941180588139, 5888.646681199141, 5896.941030589725, 5921.792737254262, 4480.7535585542455, 4481.462224533077, 4489.191945449785, 4495.57292057254, 4525.275955847049, 3952.7628342299554, 3998.540167880673, 4033.394990751352, 4065.79671016448, 4079.224947260011, 5660.801871934463, 5701.372848986608, 5756.194132821408, 5769.0192667246665, 5769.134629805562, 6009.549283803733, 6015.398460154037, 6018.307894592178, 6028.457438830526, 6029.487493563009, 5657.405972372924, 5750.6262092963825, 5781.421857814269, 5823.388544202798, 5835.037218858925, 5165.896682066337, 5174.6377753557645, 5181.326427564468, 5204.687718736888, 5219.295395121686, 6220.626762394271, 6233.2208473940755, 6283.622982620966, 6286.465650419674, 6307.463865571478, 5896.0, 5976.581639285208, 6008.429199226067, 6028.306744724413, 6061.181740464981, 6222.0355844844125, 6228.501719862309, 6244.968775156095, 6247.812565623039, 6262.0, 5889.734961926809, 5902.7343769531335, 5903.75698163677, 5916.26046744157, 5938.940610593839, 5849.912251316148, 5912.645241285537, 5959.1657167995645, 6022.156898034366, 6043.395660433922, 5787.160861674949, 5789.363170051207, 5792.478676919098, 5792.681402522733, 5801.767929282782, 5712.485876271156, 5799.594028418139, 5803.680797556175, 5808.041673123887, 5812.924608947358, 5459.426760190282, 5581.776728930798, 5610.214569960291, 5632.605717599892, 5638.85902852432, 5796.82609521715, 5805.361410244954, 5826.82519524415, 5827.94172058274, 5844.883102337844, 5550.888982220414, 5685.090385538294, 5688.374278829243, 5712.400197979152, 5738.942610573841], "unit": "score", "name": "dojo.html", "value": 5483.822995623439}, {"lowerIsBetter": false, "replicates": [506.1724081127356, 522.062897099706, 534.8475684429939, 555.0924238869449, 578.9838832848351, 31398.84300578497, 38986.220275594475, 39634.60365396345, 40037.0, 40084.1983160337, 43228.35157472632, 43427.78286108573, 43733.7813310933, 43923.78038109813, 44015.11969760611, 8822.029576746569, 9034.638614455414, 9036.412633178856, 9050.09499050093, 9050.411723237969, 8784.736457906272, 8950.462972221654, 8951.95524022379, 8962.37263391563, 8964.372493925428, 9071.682491112811, 9127.178553930145, 9149.771255718593, 9152.313576481758, 9163.404378715362, 9187.0, 9252.259819214447, 9256.0, 9267.490288034156, 9304.860427093565, 9042.140996605312, 9169.0, 9176.357654964155, 9197.0, 9199.678011269574, 43343.13313733708, 43723.0, 43808.342874856906, 43898.0, 44164.77917610391, 3192.4732419150814, 3319.6016478022793, 3353.3460975109865, 3581.9641803582153, 3879.8448062077764, 33109.66890331114, 33129.0, 33348.83325583381, 33787.986360409224, 34112.65887341144, 4264.317709166518, 4269.850555230552, 4292.484901811771, 4301.268784306675, 4333.674974376903, 291958.0, 292072.0, 292301.99999999785, 293601.0, 294967.0, 46223.5377646226, 65842.0, 65946.0, 66054.33945660578, 66361.6681916597, 44837.327440088426, 44859.32711009338, 45057.54942450599, 45073.54926450693, 45279.54720452753, 16748.497545073667, 17018.914905425394, 17037.14814259282, 17076.487705368858, 17079.914600426917, 13770.311484425738, 13791.51729689456, 13810.240436775874, 13818.239996800272, 13870.306484675726, 15343.923280383528, 15366.0, 16004.359825607078, 16119.355225791072, 16139.870209085486, 5938.0, 5956.493698035629, 5958.186760473301, 6042.546808989343, 6179.567430279927, 1048.7483004079118, 1085.8544235831116, 1116.9273997190157, 1139.789139009286, 1181.167277069664, 30355.392892142034, 30799.0, 31309.373812524078, 31426.37147257042, 31555.0, 1036.6889933020063, 1065.648336049102, 1082.5994382078525, 1106.4578356605366, 1184.8815118488083, 15844.52466426009, 15954.76067858983, 16025.599360016093, 16145.112018838841, 16368.263428145761, 367814.0, 804919.0, 807053.0, 811371.0, 813217.0, 62188.68905655443, 62691.373086269465, 62943.0, 63021.0, 63145.36854631395, 1473.366452425446, 1481.799957005812, 1494.790729297921, 1511.5843143135726, 1540.776587394844, 31710.0, 32175.0, 32468.67531324751, 32622.67377326291, 33109.83445082855, 50818.49181508285, 51421.0, 51558.48441515687, 51725.0, 51969.740151299, 315621.0, 317347.0, 317698.0, 319243.0, 320287.0, 34905.47641785324, 35209.47185792266, 35329.47005794864, 35649.643503564635, 36167.81916090403, 47440.52559474361, 48478.757606211744, 48509.75745121252, 48618.270725939845, 48741.5125848737, 39094.609053909095, 40676.186476269715, 41154.0, 41768.58231417647, 41916.161676766904, 40082.59917400789, 40101.598984010954, 40307.79846100751, 40664.79667601643, 40991.590084098774, 38982.22035559216, 40389.59610403976, 40745.0, 41215.0, 41687.37468938029, 35725.821370892976, 35778.0, 36183.45724814183, 37098.8145059273, 38420.0, 27193.45613087767, 27868.721312786613, 27897.860510697315, 27915.581266280617, 28045.439091218468], "unit": "score", "name": "ext.html", "value": 19900.507785949496}, {"lowerIsBetter": false, "replicates": [361.08284956211224, 364.5242957939889, 368.9022409061598, 373.9270842185775, 377.73747245664276, 17930.37243696469, 18809.0, 20372.286969956018, 20434.182632694694, 20451.386458406236, 17155.399561015336, 18363.173657185424, 18889.811101888976, 18948.0, 18955.431337059876, 5487.588430867681, 5704.942950570483, 5730.942690573103, 5739.598228124033, 5767.711614419283, 5278.419373868871, 5492.588055895823, 5497.725113744316, 5510.862228444281, 5587.245721827542, 5428.050091234038, 5468.562514998791, 5501.367342755574, 5520.254765606632, 6332.620042797447, 6133.29467111279, 6160.1991741073825, 6182.072689096626, 6235.625862448245, 6250.4374606285655, 5167.715775632339, 5391.649542779707, 5569.0, 5571.164325351229, 5582.385937546866, 13960.86039139616, 13978.860211397858, 14192.716145677132, 14204.147751134966, 20534.58930821375, 2085.1882986713936, 2125.0968338456096, 2152.2897443843494, 2247.1797793805144, 2457.3856535866034, 9869.950650246774, 10086.596536138546, 10290.43402612856, 10514.158867290598, 10570.0, 1894.1287007976348, 1903.4670292318174, 1911.340587497325, 1950.7073938909136, 2003.1186278037762, 62418.687906560175, 64406.67796661033, 65272.0, 65292.36769080764, 66088.3391166087, 10239.948800255952, 10409.375437473776, 10489.947550262199, 10748.946255268673, 10843.67468975932, 14953.40186392532, 15047.172405517802, 15091.773623395658, 15098.773518397233, 15157.924210378878, 8321.500709957421, 8580.313574914117, 8598.484090954562, 8601.698940537051, 8607.956960215159, 8352.540610266493, 8468.195521425454, 8486.787830304293, 8490.066092729794, 8535.615897284637, 4294.7852607369505, 4738.241881298975, 4771.5467030632035, 4784.832530861473, 4864.419063804277, 1919.5872887329292, 1978.0703069557285, 1980.4454752669276, 1982.930597429083, 2031.6444622191057, 962.0908241711516, 1017.4810846468206, 1053.1785207538132, 1135.1316243074054, 1160.930344179352, 17602.647947040987, 18058.548536286435, 18183.181756820974, 18353.3576324828, 18756.906215468836, 1015.9695209143738, 1040.573364920379, 1045.2839804733783, 1079.96220132295, 1089.2375337263948, 10291.433971131659, 10574.629887953884, 10601.787964240671, 10604.575816967235, 10632.202584806171, 456499.0, 456984.0, 458120.0, 460974.0, 462646.0, 77051.0, 80262.19737802664, 80464.59767701125, 80816.0, 81012.59493702494, 1084.6366467233408, 1087.7008822573855, 1090.650991682654, 1093.6445655162104, 1105.2760441910561, 16151.596210094842, 16249.59376015609, 16432.178391080637, 16467.83532164663, 16708.58228544296, 32734.0, 33082.66917330796, 34191.31617367589, 34548.82725586356, 35629.109272268404, 45188.0, 48169.0, 48852.755736221094, 48996.5100348992, 49312.26031609457, 8648.56757162152, 8757.16562874371, 8765.430247033923, 8795.428297160664, 8829.38194326391, 9005.909940900507, 10031.54858031405, 13229.470821167046, 13295.0, 13506.459741610226, 11325.15061370417, 11472.483738231967, 11484.94257528707, 11498.712532186428, 11520.769584608428, 11314.943425282821, 11478.196526243082, 11620.477078531656, 11629.953304202663, 11686.883131168579, 11299.774004519699, 11562.0, 11691.0, 11772.705682357668, 11818.0, 7890.816377543414, 8139.4709343892455, 8477.95761021191, 8741.388102832741, 8796.516191609522, 11540.596079137189, 11576.189666723585, 11604.825927610924, 11654.41727913584, 11806.586769463027], "unit": "score", "name": "jquery.html", "value": 8871.760484362867}, {"lowerIsBetter": false, "replicates": [1559.524345074752, 1579.4550879946419, 1829.698099813531, 1908.7518622579062, 1963.2932144427994, 7375.8156046098875, 8043.91956080439, 8106.351491880643, 8255.91744082559, 8256.999999999993, 8187.26314631683, 8231.42380033398, 8237.752867413972, 8299.709510167146, 8359.791005224857, 2457.176845756669, 2475.962860557093, 2481.789047930928, 2483.987580062097, 2498.962515562268, 2399.6280576510667, 2453.86503742295, 2465.0, 2470.7158676752224, 2482.888270027844, 2446.425090103824, 2470.938226544342, 2494.1769216158623, 2499.450120973383, 2505.035561308891, 2368.97631023691, 2381.833271670984, 2390.4501964548076, 2410.1323523531514, 2422.5760491913934, 2475.1460746042585, 2499.687539057618, 2505.6742623458836, 2511.1336588876807, 2513.308840068996, 8624.956875215585, 8664.0, 8668.349873759431, 8693.5218562979, 8708.25979791712, 5323.22813192085, 5409.540189083893, 5458.699771512565, 5459.044667183227, 5482.506574408322, 3281.392942305681, 3292.3909076820864, 3310.2717402171484, 3358.546596209505, 3388.373150967079, 1015.2537884654773, 1020.1277907389224, 1068.1027936533349, 1072.463768115942, 1077.095239998405, 11006.174536909684, 11016.559337626486, 11062.834057489144, 11063.0, 11088.55645774168, 4661.137689527381, 4798.95201047985, 4801.327814106028, 4811.975940120277, 4823.300621409876, 10097.949510252402, 10150.543225554868, 10153.187744980383, 10167.4916254187, 10171.0, 5302.840914772563, 5421.972890135524, 5429.267048948342, 5434.864128396822, 5465.234867118606, 4157.958420415817, 4577.816887324537, 4591.77041147948, 4704.1062198182235, 4861.611071114302, 3850.96149038506, 3901.395283731026, 3912.3349030664854, 3915.275674000319, 3932.528096628366, 1293.32100647161, 1300.7983762516826, 1304.4456106154846, 1305.47128412991, 1316.3089378076586, 1047.0, 1054.0776820282254, 1061.570064124031, 1421.1118051217989, 1463.6999415120088, 7848.332891704269, 7911.802204944807, 7929.167437419103, 8112.0, 8155.306798922039, 1181.710480932177, 1192.8807119288, 1218.5308656167263, 1222.0468034932767, 1232.4269214814974, 6241.625502469867, 6275.529335299871, 6285.622862628257, 6306.306306306303, 6341.048842673636, 10446.843297350546, 10803.13574914005, 10832.67501974942, 10966.342019478856, 10993.780124397626, 10358.119559837498, 10522.684319470429, 10602.787944241072, 10725.624603138853, 10746.623868164734, 7688.654010569538, 7779.7666070017995, 7826.7651970440975, 7877.606119693993, 7906.486078404885, 7625.885611715939, 7638.15980242184, 7696.8075798103255, 7835.529868207926, 7920.485168464032, 9120.087991200828, 9129.634814607341, 9210.95394523023, 9229.307801915018, 9394.624215031323, 9302.069793020644, 9330.346875718635, 9426.905730942603, 9567.37812042215, 9568.043195680377, 7021.3329733677265, 7164.781987062108, 7177.1746249182015, 7300.12398512182, 7393.408527317694, 7968.6414111363965, 7973.681052757825, 7997.0, 7997.400194985516, 8008.479448835807, 7313.490993016326, 7532.54804711719, 7564.962175189089, 7625.351845093007, 7627.580483073484, 7339.889901651586, 7346.77959661211, 7404.666789994355, 7419.369353605004, 7474.103107627119, 7678.5392876427595, 7698.769036928901, 7723.497972631761, 7731.613419329124, 7744.845103097794, 7024.438044956493, 7076.22161562238, 7103.502754807114, 7126.465515086493, 7131.144262688511, 7040.049593304839, 7060.1880783708475, 7070.36366726997, 7085.397741192057, 7124.608146551782], "unit": "score", "name": "mootools.html", "value": 4889.244535862541}, {"lowerIsBetter": false, "replicates": [325.1886543075028, 329.7971747375364, 331.9883804066858, 336.86357025404686, 337.7652531490613, 6275.6548389838545, 6321.6523091229965, 6323.05154226865, 6324.209473815778, 6325.968370158149, 6248.094026366174, 6252.155958945541, 6264.123022776804, 6277.780277690282, 6284.245890493147, 4601.3558101865765, 4740.454847692507, 4766.142094423002, 4782.187028205213, 4800.735959522233, 4681.578657920786, 4739.289106633998, 4754.833580824672, 4758.357621721076, 4762.190427627294, 4682.7892744826395, 4704.0356726870905, 4704.506026867181, 4708.623310135198, 4715.363425937506, 4712.3873896393425, 4717.433907931036, 4729.314249433847, 4730.8344207952905, 4733.313669517918, 4095.28332541804, 4109.219248342805, 4111.054457474767, 4111.48606424197, 4112.444819949298, 5885.61743486672, 5886.146508756249, 5891.734871930774, 5892.322382925932, 5907.172995780594, 5305.522502974713, 5435.157550579627, 5458.9454105458835, 5506.03644362235, 5514.310711161105, 6544.051112588696, 6575.408213260829, 6631.204255489324, 6667.599944003376, 6679.432248258904, 4510.797014134372, 4530.77346132692, 4532.0, 4540.250858608326, 4548.704334218299, 6909.067275917737, 6928.0, 6972.825679358006, 6990.54561453509, 6996.0, 4630.467496237909, 4639.489656137822, 4675.18184317743, 4685.554872287127, 4696.436427628638, 4607.35497030416, 4712.481627021025, 4724.929126063112, 4737.620990320766, 4756.809727610926, 5496.395396506381, 5551.7779288828, 5552.278203833475, 5554.0, 5560.499555040065, 6779.49153813466, 6782.0, 6789.1852977643, 6840.897386539206, 6879.965600171967, 1666.6666666666472, 1695.1439523040785, 1700.948971530856, 1701.3960044184137, 1704.113860792381, 1060.437967877011, 1088.357868857362, 1088.684281558355, 1092.9289596176222, 1108.4402376799665, 6634.734610615521, 6639.601623902581, 6656.267810540837, 6691.1636045494315, 6693.631850248283, 6915.688794004282, 6937.057623865326, 6938.479614028968, 6943.444524438033, 6956.860862782817, 6347.5556711029785, 6439.967800160969, 6562.80311590653, 6606.8348291293105, 6615.305392933673, 3776.3957766757735, 3808.1622043150464, 3808.9809550952623, 3814.8664796731982, 3817.6945844332386, 7404.1855395906405, 7409.666565004588, 7410.258974102547, 7413.962930185315, 7423.48035637511, 7180.31786980236, 7190.604516751629, 7229.783106506813, 7251.1661158966335, 7261.164966028869, 7090.397316228178, 7323.231060738653, 7331.413486921034, 7332.96333518329, 7401.703931842773, 7014.614196219257, 7027.332403421667, 7028.472864535078, 7031.613261270679, 7048.859022819617, 6927.653617319013, 6943.40981016599, 6945.965270173617, 6959.373656370951, 6972.058772065706, 7395.926040739739, 7399.8150046249275, 7400.444966627417, 7405.666744996381, 7422.29086383477, 4714.457837348748, 4847.733374664427, 4871.561559459666, 4897.0450762101045, 4947.678400903929, 6923.7576684817805, 6971.337722916315, 6979.406750426067, 6980.546264492792, 7043.013978043181, 6740.359665831738, 6742.25835158142, 6745.4266387355665, 6748.966255168692, 6782.253952065367, 6793.388595026471, 6829.2487826338065, 6835.521513494206, 6837.213720422215, 6842.042114104129, 6409.871802563829, 6606.735730570724, 6672.499562532927, 6688.0, 6723.1259936209935, 6764.695588698422, 6764.93235067643, 6770.52606317553, 6804.931950680628, 6854.417374523221, 6630.668466576748, 6637.933620663925, 6676.9332306676315, 6695.363940425652, 6722.0], "unit": "score", "name": "prototype.html", "value": 5051.23078575109}, {"lowerIsBetter": false, "replicates": [884.6742609490861, 893.044442446582, 894.2488309819751, 902.1474706402444, 915.9587818548167, 14794.0, 14989.850101498996, 15005.924970375147, 15011.249437528135, 15043.623909402271, 14062.929685351559, 14076.788848167285, 14202.78695819561, 14237.71524569508, 14241.074330168532, 757.5984728094119, 925.2967744514184, 928.642472648032, 929.0430856218106, 941.1482608239554, 935.6117211357313, 939.1500691873831, 940.9059094090604, 943.2548286853378, 948.8576713492997, 996.3324572536382, 997.4813097189457, 998.1066945084145, 999.6101520407047, 1008.8890222075565, 978.872746542952, 984.7931934293807, 985.7584891701507, 991.8561808537721, 1000.8148492528869, 735.3639102176633, 738.4018944654847, 739.3863093632326, 739.548875186136, 743.1194035068407, 14263.429462821474, 14292.928535357256, 14300.499482518062, 14308.92845535776, 14350.569482915425, 13913.443462261599, 14012.089214201043, 14117.576472705836, 14137.646558836008, 14147.504837330747, 11449.656510304705, 11551.53793848245, 11554.364509951949, 11587.304761714324, 11717.179797414185, 3903.4535165076913, 3956.188981258835, 4012.9398059029136, 4026.053877338823, 4040.070783719761, 47114.52885471136, 47144.29283560715, 47160.0, 47162.0, 47518.0, 10513.158947284199, 10562.524686389132, 10593.470326483644, 10736.141108711285, 10979.505922233358, 19124.33064842724, 19128.61742765137, 19340.613187736166, 19367.709484357747, 19871.205151794056, 8280.83438331242, 8282.254597086292, 8330.375221858385, 8364.121767214476, 8369.3304535637, 4053.1893621275863, 4345.109252603209, 4361.433013708198, 4389.209942210433, 4389.780510974439, 3313.784604000732, 3351.312980838922, 3352.6479719629574, 3356.060303115132, 3358.1268870093463, 620.2092332276294, 621.5183232994466, 627.9120923070774, 628.5914155798768, 633.4457349818908, 592.4874983139554, 635.2440595691113, 679.9490038247151, 685.0614657918584, 693.9167299924042, 8012.0786109596975, 8090.797730056678, 8186.2632363087605, 8596.570171491401, 8653.913460865437, 574.7959474386616, 610.3835126522245, 651.9413252807175, 661.7452280871898, 681.621699956519, 3878.4764056852528, 4070.898227544276, 4110.568390319033, 4145.854895078658, 4153.460050193456, 54116.72941635267, 54729.0, 54797.0, 54841.72579137079, 54861.725691371284, 48859.267110993365, 49503.0, 50465.49534504682, 50668.239976400386, 51556.74221628868, 46271.07457850824, 46491.070178596914, 46567.53432465632, 47072.764636177286, 47810.28284575734, 7831.334336581454, 7852.175521570153, 7955.085165205844, 7999.160088190656, 8296.70961516344, 34833.0, 34915.65084349226, 36145.457818133276, 36340.27319453543, 38634.42048369221, 41950.0, 42296.5770342305, 42667.57332426636, 42995.140097198506, 43993.78003109964, 12073.75852482963, 12200.572979945659, 12203.309035295024, 12275.140740148105, 12596.370181491073, 12934.417951192407, 13795.310234488035, 13968.092074015156, 14223.857761422667, 14652.413903444169, 11263.49314280843, 11380.317180969168, 11431.59989400367, 11456.19806613529, 11475.368854713071, 11397.943010285228, 11499.540018399504, 11721.648350549498, 11774.94112529432, 11883.0, 10806.567737290421, 11376.317420954769, 11391.715207119556, 12397.75204495923, 12708.809367859674, 10578.629747959092, 10620.937906209318, 10705.518251678537, 11090.889091108986, 11349.4892729829, 10044.347117437343, 10047.296689231684, 10215.642452514126, 10314.801077383376, 10321.63874264397], "unit": "score", "name": "yui.html", "value": 6695.533936106494}], "name": "dromaeo_css", "value": 7368.904572313833}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 112.0, 106.0, 110.0, 113.0, 111.0, 105.0, 112.0, 113.0, 111.0], "unit": "score", "name": "ai-astar", "value": 110.4}, {"lowerIsBetter": true, "replicates": [161.0, 134.0, 151.0, 168.0, 136.0, 160.0, 160.0, 129.0, 166.0, 134.0], "unit": "score", "name": "audio-beat-detection", "value": 149.9}, {"lowerIsBetter": true, "replicates": [162.0, 162.0, 162.0, 163.0, 164.0, 164.0, 162.0, 161.0, 163.0, 163.0], "unit": "score", "name": "audio-dft", "value": 162.6}, {"lowerIsBetter": true, "replicates": [78.0, 82.0, 77.0, 163.0, 75.0, 77.0, 75.0, 74.0, 163.0, 77.0], "unit": "score", "name": "audio-fft", "value": 94.1}, {"lowerIsBetter": true, "replicates": [93.0, 94.0, 141.0, 93.0, 95.0, 94.0, 143.0, 94.0, 95.0, 152.0], "unit": "score", "name": "audio-oscillator", "value": 109.4}, {"lowerIsBetter": true, "replicates": [117.0, 117.0, 117.0, 118.0, 117.0, 117.0, 118.0, 117.0, 117.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.2}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 147.0, 146.0, 147.0, 147.0, 148.0, 147.0, 147.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 146.7}, {"lowerIsBetter": true, "replicates": [97.0, 96.0, 96.0, 96.0, 98.0, 96.0, 96.0, 96.0, 96.0, 97.0], "unit": "score", "name": "imaging-desaturate", "value": 96.4}, {"lowerIsBetter": true, "replicates": [55.0, 57.0, 56.0, 55.0, 56.0, 57.0, 56.0, 59.0, 63.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 56.9}, {"lowerIsBetter": true, "replicates": [65.0, 65.0, 65.0, 65.0, 65.0, 65.0, 65.0, 65.0, 64.0, 66.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 65.0}, {"lowerIsBetter": true, "replicates": [80.0, 81.0, 80.0, 80.0, 80.0, 80.0, 80.0, 80.0, 80.0, 83.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.4}, {"lowerIsBetter": true, "replicates": [119.0, 114.0, 115.0, 118.0, 125.0, 122.0, 117.0, 114.0, 114.0, 116.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 117.4}, {"lowerIsBetter": true, "replicates": [146.0, 135.0, 141.0, 146.0, 145.0, 135.0, 145.0, 142.0, 144.0, 132.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 141.1}, {"lowerIsBetter": true, "replicates": [74.0, 70.0, 70.0, 68.0, 67.0, 66.0, 65.0, 75.0, 71.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 69.3}], "name": "kraken", "value": 1516.8}]} 16:57:39 INFO - Return code: 0 16:57:39 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 16:57:39 ERROR - # TBPL SUCCESS # 16:57:39 INFO - Running post-action listener: _resource_record_post_action 16:57:39 INFO - Running post-run listener: _resource_record_post_run 16:57:40 INFO - Total resource usage - Wall time: 1184s; CPU: 13.0%; Read bytes: 16384; Write bytes: 466165760; Read time: 36; Write time: 348628 16:57:40 INFO - install - Wall time: 13s; CPU: 14.0%; Read bytes: 0; Write bytes: 193994752; Read time: 0; Write time: 178124 16:57:40 INFO - run-tests - Wall time: 1171s; CPU: 13.0%; Read bytes: 16384; Write bytes: 217985024; Read time: 36; Write time: 147704 16:57:40 INFO - Running post-run listener: _upload_blobber_files 16:57:40 INFO - Blob upload gear active. 16:57:40 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:57:40 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 16:57:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 16:57:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 16:57:41 INFO - (blobuploader) - INFO - Open directory for files ... 16:57:41 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 16:57:41 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:57:41 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:57:42 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 16:57:42 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:57:42 INFO - (blobuploader) - INFO - Done attempting. 16:57:42 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 16:57:42 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:57:42 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:57:42 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 16:57:42 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:57:42 INFO - (blobuploader) - INFO - Done attempting. 16:57:42 INFO - (blobuploader) - INFO - Iteration through files over. 16:57:42 INFO - Return code: 0 16:57:42 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:57:42 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:57:42 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0aa50303da3430b17f7388774f1429465d3d3fc7923e59da24ffcfc15b9fab398071886614076a4f41179423fee70ad99e2f5e71f5123ede344fa91b46a3b0e8", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/1c0628136c080d1497b2bdf0f46cba030c7157c4eb3a745e07806dfc607cfc3247e7310596b63ba61173adf1393be4625433d04907a34da967e59074a559c198"} 16:57:42 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:57:42 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:57:42 INFO - Contents: 16:57:42 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0aa50303da3430b17f7388774f1429465d3d3fc7923e59da24ffcfc15b9fab398071886614076a4f41179423fee70ad99e2f5e71f5123ede344fa91b46a3b0e8", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/1c0628136c080d1497b2bdf0f46cba030c7157c4eb3a745e07806dfc607cfc3247e7310596b63ba61173adf1393be4625433d04907a34da967e59074a559c198"} 16:57:42 INFO - Running post-run listener: copy_logs_to_upload_dir 16:57:42 INFO - Copying logs to upload dir... 16:57:42 INFO - mkdir: /builds/slave/test/build/upload/logs 16:57:42 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1255.088853 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 55 secs) (at 2016-05-30 16:57:42.426041) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-30 16:57:42.429065) ========= 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=4300f881736b422476174874000001bc-1464650960.296021-1071286981 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-Beta/sha512/0aa50303da3430b17f7388774f1429465d3d3fc7923e59da24ffcfc15b9fab398071886614076a4f41179423fee70ad99e2f5e71f5123ede344fa91b46a3b0e8", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/1c0628136c080d1497b2bdf0f46cba030c7157c4eb3a745e07806dfc607cfc3247e7310596b63ba61173adf1393be4625433d04907a34da967e59074a559c198"} build_url:https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011482 build_url: 'https://queue.taskcluster.net/v1/task/NlZf2TaITQq31TgRtOAIMA/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0aa50303da3430b17f7388774f1429465d3d3fc7923e59da24ffcfc15b9fab398071886614076a4f41179423fee70ad99e2f5e71f5123ede344fa91b46a3b0e8", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/1c0628136c080d1497b2bdf0f46cba030c7157c4eb3a745e07806dfc607cfc3247e7310596b63ba61173adf1393be4625433d04907a34da967e59074a559c198"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-30 16:57:42.454186) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 16:57:42.454492) ========= 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=4300f881736b422476174874000001bc-1464650960.296021-1071286981 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004580 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-30 16:57:42.538349) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-30 16:57:42.538777) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-30 16:57:42.539121) ========= ========= Total master_lag: 0.19 =========