builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-065 starttime: 1461702535.25 results: success (0) buildid: 20160425205003 builduid: 68a02e46d6d349f3b74437b25b685305 revision: 5bbf2e7c2fc6ff9010b1948e2f11477f48ee36e2 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.245556) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.245994) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.246270) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.265654) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.265993) ========= 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=523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-26 13:28:56-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 222M=0s 2016-04-26 13:28:56 (222 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.097291 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.376339) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.376650) ========= 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=523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018349 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.429405) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.432811) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 5bbf2e7c2fc6ff9010b1948e2f11477f48ee36e2 --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 5bbf2e7c2fc6ff9010b1948e2f11477f48ee36e2 --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=523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-26 13:28:56,966 truncating revision to first 12 chars 2016-04-26 13:28:56,966 Setting DEBUG logging. 2016-04-26 13:28:56,966 attempt 1/10 2016-04-26 13:28:56,966 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/5bbf2e7c2fc6?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-26 13:28:57,199 unpacking tar archive at: mozilla-beta-5bbf2e7c2fc6/testing/mozharness/ program finished with exit code 0 elapsedTime=0.517469 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.963017) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.963349) ========= script_repo_revision: 5bbf2e7c2fc6ff9010b1948e2f11477f48ee36e2 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.963764) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.964028) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-26 13:28:55.972062) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 25 mins, 15 secs) (at 2016-04-26 13:28:55.972640) ========= /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=523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 13:28:57 INFO - MultiFileLogger online at 20160426 13:28:57 in /builds/slave/test 13:28:57 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 13:28:57 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 13:28:57 INFO - {'append_to_log': False, 13:28:57 INFO - 'base_work_dir': '/builds/slave/test', 13:28:57 INFO - 'blob_upload_branch': 'Mozilla-Beta', 13:28:57 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 13:28:57 INFO - 'branch': 'Mozilla-Beta', 13:28:57 INFO - 'buildbot_json_path': 'buildprops.json', 13:28:57 INFO - 'config_files': ('talos/linux_config.py',), 13:28:57 INFO - 'default_actions': ('clobber', 13:28:57 INFO - 'read-buildbot-config', 13:28:57 INFO - 'download-and-extract', 13:28:57 INFO - 'populate-webroot', 13:28:57 INFO - 'create-virtualenv', 13:28:57 INFO - 'install', 13:28:57 INFO - 'run-tests'), 13:28:57 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 13:28:57 INFO - 'download_minidump_stackwalk': True, 13:28:57 INFO - 'download_symbols': 'ondemand', 13:28:57 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 13:28:57 INFO - 'tooltool.py': '/tools/tooltool.py', 13:28:57 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 13:28:57 INFO - '/tools/misc-python/virtualenv.py')}, 13:28:57 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 13:28:57 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 13:28:57 INFO - 'installer_path': 'installer.exe', 13:28:57 INFO - 'log_level': 'info', 13:28:57 INFO - 'log_name': 'talos', 13:28:57 INFO - 'log_to_console': True, 13:28:57 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 13:28:57 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 13:28:57 INFO - 'opt_config_files': (), 13:28:57 INFO - 'pip_index': False, 13:28:57 INFO - 'sps_profile': False, 13:28:57 INFO - 'sps_profile_interval': 0, 13:28:57 INFO - 'suite': 'dromaeojs-e10s', 13:28:57 INFO - 'system_bits': '32', 13:28:57 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 13:28:57 INFO - 'title': 'talos-linux64-ix-065', 13:28:57 INFO - 'tooltool_cache': '/builds/tooltool_cache', 13:28:57 INFO - 'use_talos_json': True, 13:28:57 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 13:28:57 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 13:28:57 INFO - 'work_dir': 'build'} 13:28:57 INFO - ##### 13:28:57 INFO - ##### Running clobber step. 13:28:57 INFO - ##### 13:28:57 INFO - Running pre-action listener: _resource_record_pre_action 13:28:57 INFO - Running main action method: clobber 13:28:57 INFO - rmtree: /builds/slave/test/build 13:28:57 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 13:28:58 INFO - Running post-action listener: _resource_record_post_action 13:28:58 INFO - ##### 13:28:58 INFO - ##### Running read-buildbot-config step. 13:28:58 INFO - ##### 13:28:58 INFO - Running pre-action listener: _resource_record_pre_action 13:28:58 INFO - Running main action method: read_buildbot_config 13:28:58 INFO - Using buildbot properties: 13:28:58 INFO - { 13:28:58 INFO - "project": "", 13:28:58 INFO - "product": "firefox", 13:28:58 INFO - "script_repo_revision": "production", 13:28:58 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s", 13:28:58 INFO - "repository": "", 13:28:58 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs-e10s", 13:28:58 INFO - "buildid": "20160425205003", 13:28:58 INFO - "pgo_build": "True", 13:28:58 INFO - "basedir": "/builds/slave/test", 13:28:58 INFO - "buildnumber": 73, 13:28:58 INFO - "slavename": "talos-linux64-ix-065", 13:28:58 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 13:28:58 INFO - "platform": "ubuntu64_hw", 13:28:58 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 13:28:58 INFO - "branch": "mozilla-beta", 13:28:58 INFO - "repo_path": "releases/mozilla-beta", 13:28:58 INFO - "revision": "5bbf2e7c2fc6ff9010b1948e2f11477f48ee36e2", 13:28:58 INFO - "stage_platform": "linux64-pgo", 13:28:58 INFO - "builduid": "68a02e46d6d349f3b74437b25b685305", 13:28:58 INFO - "slavebuilddir": "test" 13:28:58 INFO - } 13:28:58 INFO - Found installer url https://queue.taskcluster.net/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2. 13:28:58 INFO - Running post-action listener: _resource_record_post_action 13:28:58 INFO - ##### 13:28:58 INFO - ##### Running download-and-extract step. 13:28:58 INFO - ##### 13:28:58 INFO - Running pre-action listener: _resource_record_pre_action 13:28:58 INFO - Running main action method: download_and_extract 13:28:58 INFO - mkdir: /builds/slave/test/build/tests 13:28:58 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')]} 13:28:58 INFO - https://queue.taskcluster.net/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 13:28:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 13:28:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 13:28:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/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 13:28:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/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 13:29:00 INFO - Downloaded 1412 bytes. 13:29:00 INFO - Reading from file /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 13:29:00 INFO - Using the following test package requirements: 13:29:00 INFO - {u'common': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 13:29:00 INFO - u'cppunittest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:00 INFO - u'firefox-47.0.en-US.linux-x86_64.cppunittest.tests.zip'], 13:29:00 INFO - u'gtest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:00 INFO - u'firefox-47.0.en-US.linux-x86_64.gtest.tests.zip'], 13:29:00 INFO - u'jittest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:00 INFO - u'jsshell-linux-x86_64.zip'], 13:29:00 INFO - u'mochitest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:00 INFO - u'firefox-47.0.en-US.linux-x86_64.mochitest.tests.zip'], 13:29:00 INFO - u'mozbase': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 13:29:00 INFO - u'reftest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:00 INFO - u'firefox-47.0.en-US.linux-x86_64.reftest.tests.zip'], 13:29:00 INFO - u'talos': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:00 INFO - u'firefox-47.0.en-US.linux-x86_64.talos.tests.zip'], 13:29:00 INFO - u'web-platform': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:00 INFO - u'firefox-47.0.en-US.linux-x86_64.web-platform.tests.zip'], 13:29:00 INFO - u'webapprt': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 13:29:00 INFO - u'xpcshell': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:00 INFO - u'firefox-47.0.en-US.linux-x86_64.xpcshell.tests.zip']} 13:29:00 INFO - Downloading packages: [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 13:29:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:29:00 INFO - https://queue.taskcluster.net/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 13:29:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 13:29:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 13:29:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/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 13:29:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/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 13:33:48 INFO - Downloaded 23363259 bytes. 13:33:48 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'] 13:33:48 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 13:33:49 INFO - Return code: 0 13:33:49 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 13:33: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')]} 13:33:49 INFO - https://queue.taskcluster.net/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 13:33:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 13:33:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.common.tests.zip 13:33:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/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 13:33:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/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 13:33:52 INFO - Downloaded 23363259 bytes. 13:33:52 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'] 13:33:52 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 13:33:54 INFO - Return code: 0 13:33:54 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')]} 13:33:54 INFO - https://queue.taskcluster.net/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 13:33:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 13:33:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.talos.tests.zip 13:33:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/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 13:33:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/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 13:33:56 INFO - Downloaded 10845194 bytes. 13:33:56 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'] 13:33:56 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 13:33:56 INFO - Return code: 0 13:33:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:33:56 INFO - https://queue.taskcluster.net/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 13:33:56 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 13:33:56 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 13:33:56 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/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 13:33:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/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 13:33:58 INFO - Downloaded 53786059 bytes. 13:33:58 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 13:33:58 INFO - mkdir: /builds/slave/test/properties 13:33:58 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 13:33:58 INFO - Writing to file /builds/slave/test/properties/build_url 13:33:58 INFO - Contents: 13:33:58 INFO - build_url:https://queue.taskcluster.net/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 13:34:00 INFO - Running post-action listener: _resource_record_post_action 13:34:00 INFO - Running post-action listener: set_extra_try_arguments 13:34:00 INFO - ##### 13:34:00 INFO - ##### Running populate-webroot step. 13:34:00 INFO - ##### 13:34:00 INFO - Running pre-action listener: _resource_record_pre_action 13:34:00 INFO - Running main action method: populate_webroot 13:34:00 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 13:34:00 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 13:34:00 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 13:34:00 INFO - '--tppagecycles', 13:34:00 INFO - '7'], 13:34:00 INFO - 'tests': ['tsvgm']}}, 13:34:00 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 13:34:00 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 13:34:00 INFO - 'tests': ['tresize', 'tcanvasmark']}, 13:34:00 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 13:34:00 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 13:34:00 INFO - 'tests': ['dromaeo_css', 'kraken']}, 13:34:00 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:34:00 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:34:00 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:34:00 INFO - 'talos_options': ['--e10s'], 13:34:00 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:34:00 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:34:00 INFO - 'tests': ['damp', 'tps']}, 13:34:00 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:34:00 INFO - 'talos_options': ['--e10s'], 13:34:00 INFO - 'tests': ['damp', 'tps']}, 13:34:00 INFO - 'g3': {'tests': ['dromaeo_dom']}, 13:34:00 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 13:34:00 INFO - 'other': {'tests': ['a11yr', 13:34:00 INFO - 'ts_paint', 13:34:00 INFO - 'tpaint', 13:34:00 INFO - 'sessionrestore', 13:34:00 INFO - 'sessionrestore_no_auto_restore', 13:34:00 INFO - 'tabpaint']}, 13:34:00 INFO - 'other-e10s': {'talos_options': ['--e10s'], 13:34:00 INFO - 'tests': ['a11yr', 13:34:00 INFO - 'ts_paint', 13:34:00 INFO - 'tpaint', 13:34:00 INFO - 'sessionrestore', 13:34:00 INFO - 'sessionrestore_no_auto_restore', 13:34:00 INFO - 'tabpaint']}, 13:34:00 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 13:34:00 INFO - 'tests': ['a11yr', 13:34:00 INFO - 'ts_paint', 13:34:00 INFO - 'tpaint', 13:34:00 INFO - 'sessionrestore', 13:34:00 INFO - 'sessionrestore_no_auto_restore', 13:34:00 INFO - 'tabpaint']}, 13:34:00 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 13:34:00 INFO - 'tests': ['a11yr', 13:34:00 INFO - 'ts_paint', 13:34:00 INFO - 'tpaint', 13:34:00 INFO - 'sessionrestore', 13:34:00 INFO - 'sessionrestore_no_auto_restore', 13:34:00 INFO - 'tabpaint']}, 13:34:00 INFO - 'other_l64': {'tests': ['a11yr', 13:34:00 INFO - 'ts_paint', 13:34:00 INFO - 'tpaint', 13:34:00 INFO - 'sessionrestore', 13:34:00 INFO - 'sessionrestore_no_auto_restore', 13:34:00 INFO - 'tabpaint']}, 13:34:00 INFO - 'other_nol64': {'tests': ['a11yr', 13:34:00 INFO - 'ts_paint', 13:34:00 INFO - 'tpaint', 13:34:00 INFO - 'sessionrestore', 13:34:00 INFO - 'sessionrestore_no_auto_restore', 13:34:00 INFO - 'tabpaint']}, 13:34:00 INFO - 'svgr': {'tests': ['tsvgx', 13:34:00 INFO - 'tsvgr_opacity', 13:34:00 INFO - 'tart', 13:34:00 INFO - 'tscrollx', 13:34:00 INFO - 'cart']}, 13:34:00 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 13:34:00 INFO - 'tests': ['tsvgx', 13:34:00 INFO - 'tsvgr_opacity', 13:34:00 INFO - 'tart', 13:34:00 INFO - 'tscrollx', 13:34:00 INFO - 'cart']}, 13:34:00 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:34:00 INFO - 'tests': ['tp5o']}, 13:34:00 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:34:00 INFO - 'talos_options': ['--e10s'], 13:34:00 INFO - 'tests': ['tp5o']}, 13:34:00 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:34:00 INFO - 'talos_options': ['--xperf_path', 13:34:00 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:34:00 INFO - 'tests': ['tp5n']}, 13:34:00 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:34:00 INFO - 'talos_options': ['--e10s', 13:34:00 INFO - '--xperf_path', 13:34:00 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:34:00 INFO - 'tests': ['tp5n']}}, 13:34:00 INFO - 'talos.zip': {'path': '', 13:34:00 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 13:34:00 INFO - Running post-action listener: _resource_record_post_action 13:34:00 INFO - ##### 13:34:00 INFO - ##### Running create-virtualenv step. 13:34:00 INFO - ##### 13:34:00 INFO - Running pre-action listener: _resource_record_pre_action 13:34:00 INFO - Running main action method: create_virtualenv 13:34:00 INFO - Creating virtualenv /builds/slave/test/build/venv 13:34:00 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 13:34:00 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 13:34:00 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 13:34:00 INFO - Using real prefix '/usr' 13:34:00 INFO - New python executable in /builds/slave/test/build/venv/bin/python 13:34:01 INFO - Installing distribute.............................................................................................................................................................................................done. 13:34:03 INFO - Installing pip.................done. 13:34:03 INFO - Return code: 0 13:34:03 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 13:34:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:34:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:34:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:03 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 0x7fe09cec1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1d410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cac160>, '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 0x1cad060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1cad4f0>, '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': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', '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 13:34:03 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 13:34:03 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 13:34:03 INFO - Using env: {'DISPLAY': ':0', 13:34:03 INFO - 'HOME': '/home/cltbld', 13:34:03 INFO - 'LANG': 'en_US.UTF-8', 13:34:03 INFO - 'LANGUAGE': 'en_US:en', 13:34:03 INFO - 'LOGNAME': 'cltbld', 13:34:03 INFO - 'MAIL': '/var/mail/cltbld', 13:34:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:34:03 INFO - 'MOZ_NO_REMOTE': '1', 13:34:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:34:03 INFO - 'NO_EM_RESTART': '1', 13:34:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:34:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:34:03 INFO - 'PWD': '/builds/slave/test', 13:34:03 INFO - 'SHELL': '/bin/bash', 13:34:03 INFO - 'SHLVL': '1', 13:34:03 INFO - 'TERM': 'linux', 13:34:03 INFO - 'TMOUT': '86400', 13:34:03 INFO - 'USER': 'cltbld', 13:34:03 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', 13:34:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:34:03 INFO - '_': '/tools/buildbot/bin/python'} 13:34:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:34:03 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 13:34:03 INFO - Cleaning up... 13:34:03 INFO - Return code: 0 13:34:03 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 13:34:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:34:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:34:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:03 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 0x7fe09cec1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1d410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cac160>, '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 0x1cad060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1cad4f0>, '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': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', '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 13:34:03 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 13:34:03 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 13:34:03 INFO - Using env: {'DISPLAY': ':0', 13:34:03 INFO - 'HOME': '/home/cltbld', 13:34:03 INFO - 'LANG': 'en_US.UTF-8', 13:34:03 INFO - 'LANGUAGE': 'en_US:en', 13:34:03 INFO - 'LOGNAME': 'cltbld', 13:34:03 INFO - 'MAIL': '/var/mail/cltbld', 13:34:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:34:03 INFO - 'MOZ_NO_REMOTE': '1', 13:34:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:34:03 INFO - 'NO_EM_RESTART': '1', 13:34:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:34:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:34:03 INFO - 'PWD': '/builds/slave/test', 13:34:03 INFO - 'SHELL': '/bin/bash', 13:34:03 INFO - 'SHLVL': '1', 13:34:03 INFO - 'TERM': 'linux', 13:34:03 INFO - 'TMOUT': '86400', 13:34:03 INFO - 'USER': 'cltbld', 13:34:03 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', 13:34:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:34:03 INFO - '_': '/tools/buildbot/bin/python'} 13:34:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:34:03 INFO - Downloading/unpacking psutil>=0.7.1 13:34:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:34:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:34:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:34:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:34:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:34:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:34:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 13:34:05 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:34:05 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:34:05 INFO - Installing collected packages: psutil 13:34:05 INFO - Running setup.py install for psutil 13:34:05 INFO - building 'psutil._psutil_linux' extension 13:34:05 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 13:34:05 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 13:34:06 INFO - building 'psutil._psutil_posix' extension 13:34:06 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 13:34:06 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 13:34:06 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:34:06 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:34:06 INFO - Successfully installed psutil 13:34:06 INFO - Cleaning up... 13:34:06 INFO - Return code: 0 13:34:06 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 13:34:06 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')]} 13:34:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:34:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:06 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')]} 13:34:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:34:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:06 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 0x7fe09cec1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1d410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cac160>, '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 0x1cad060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1cad4f0>, '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': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', '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 13:34:06 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 13:34:06 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 13:34:06 INFO - Using env: {'DISPLAY': ':0', 13:34:06 INFO - 'HOME': '/home/cltbld', 13:34:06 INFO - 'LANG': 'en_US.UTF-8', 13:34:06 INFO - 'LANGUAGE': 'en_US:en', 13:34:06 INFO - 'LOGNAME': 'cltbld', 13:34:06 INFO - 'MAIL': '/var/mail/cltbld', 13:34:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:34:06 INFO - 'MOZ_NO_REMOTE': '1', 13:34:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:34:06 INFO - 'NO_EM_RESTART': '1', 13:34:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:34:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:34:06 INFO - 'PWD': '/builds/slave/test', 13:34:06 INFO - 'SHELL': '/bin/bash', 13:34:06 INFO - 'SHLVL': '1', 13:34:06 INFO - 'TERM': 'linux', 13:34:06 INFO - 'TMOUT': '86400', 13:34:06 INFO - 'USER': 'cltbld', 13:34:06 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', 13:34:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:34:06 INFO - '_': '/tools/buildbot/bin/python'} 13:34:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:34:06 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 13:34:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:34:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:34:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:34:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:34:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:34:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:34:08 INFO - Downloading mozsystemmonitor-0.0.tar.gz 13:34:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 13:34:08 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 13:34:08 INFO - Installing collected packages: mozsystemmonitor 13:34:08 INFO - Running setup.py install for mozsystemmonitor 13:34:08 INFO - Successfully installed mozsystemmonitor 13:34:08 INFO - Cleaning up... 13:34:08 INFO - Return code: 0 13:34:08 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 13:34: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')]} 13:34:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:34:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34: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')]} 13:34:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:34:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:08 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 0x7fe09cec1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1d410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cac160>, '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 0x1cad060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1cad4f0>, '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': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', '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 13:34:08 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 13:34:08 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 13:34:08 INFO - Using env: {'DISPLAY': ':0', 13:34:08 INFO - 'HOME': '/home/cltbld', 13:34:08 INFO - 'LANG': 'en_US.UTF-8', 13:34:08 INFO - 'LANGUAGE': 'en_US:en', 13:34:08 INFO - 'LOGNAME': 'cltbld', 13:34:08 INFO - 'MAIL': '/var/mail/cltbld', 13:34:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:34:08 INFO - 'MOZ_NO_REMOTE': '1', 13:34:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:34:08 INFO - 'NO_EM_RESTART': '1', 13:34:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:34:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:34:08 INFO - 'PWD': '/builds/slave/test', 13:34:08 INFO - 'SHELL': '/bin/bash', 13:34:08 INFO - 'SHLVL': '1', 13:34:08 INFO - 'TERM': 'linux', 13:34:08 INFO - 'TMOUT': '86400', 13:34:08 INFO - 'USER': 'cltbld', 13:34:08 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', 13:34:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:34:08 INFO - '_': '/tools/buildbot/bin/python'} 13:34:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:34:08 INFO - Downloading/unpacking blobuploader==1.2.4 13:34:08 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 13:34:08 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 13:34:08 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 13:34:08 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 13:34:08 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 13:34:08 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 13:34:10 INFO - Downloading blobuploader-1.2.4.tar.gz 13:34:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 13:34:10 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 13:34:10 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 13:34:10 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 13:34:10 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 13:34:10 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 13:34:10 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 13:34:10 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 13:34:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 13:34:11 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 13:34:11 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 13:34:11 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 13:34:11 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 13:34:11 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 13:34:11 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 13:34:11 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 13:34:11 INFO - Downloading docopt-0.6.1.tar.gz 13:34:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 13:34:11 INFO - Installing collected packages: blobuploader, requests, docopt 13:34:11 INFO - Running setup.py install for blobuploader 13:34:11 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 13:34:11 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 13:34:11 INFO - Running setup.py install for requests 13:34:11 INFO - Running setup.py install for docopt 13:34:11 INFO - Successfully installed blobuploader requests docopt 13:34:11 INFO - Cleaning up... 13:34:12 INFO - Return code: 0 13:34:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:34:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:34:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:34:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:12 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 0x7fe09cec1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1d410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cac160>, '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 0x1cad060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1cad4f0>, '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': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', '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 13:34:12 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 13:34:12 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 13:34:12 INFO - Using env: {'DISPLAY': ':0', 13:34:12 INFO - 'HOME': '/home/cltbld', 13:34:12 INFO - 'LANG': 'en_US.UTF-8', 13:34:12 INFO - 'LANGUAGE': 'en_US:en', 13:34:12 INFO - 'LOGNAME': 'cltbld', 13:34:12 INFO - 'MAIL': '/var/mail/cltbld', 13:34:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:34:12 INFO - 'MOZ_NO_REMOTE': '1', 13:34:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:34:12 INFO - 'NO_EM_RESTART': '1', 13:34:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:34:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:34:12 INFO - 'PWD': '/builds/slave/test', 13:34:12 INFO - 'SHELL': '/bin/bash', 13:34:12 INFO - 'SHLVL': '1', 13:34:12 INFO - 'TERM': 'linux', 13:34:12 INFO - 'TMOUT': '86400', 13:34:12 INFO - 'USER': 'cltbld', 13:34:12 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', 13:34:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:34:12 INFO - '_': '/tools/buildbot/bin/python'} 13:34:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:34:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:34:12 INFO - Running setup.py (path:/tmp/pip-_EKywf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:34:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:34:12 INFO - Running setup.py (path:/tmp/pip-UVh0a5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:34:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:34:12 INFO - Running setup.py (path:/tmp/pip-mjO6jC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:34:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:34:12 INFO - Running setup.py (path:/tmp/pip-RFsPnC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:34:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:34:12 INFO - Running setup.py (path:/tmp/pip-hB069A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:34:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:34:12 INFO - Running setup.py (path:/tmp/pip-yY7Sss-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:34:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:34:12 INFO - Running setup.py (path:/tmp/pip-KqqUhS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:34:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:34:12 INFO - Running setup.py (path:/tmp/pip-_Fr1AJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:34:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:34:12 INFO - Running setup.py (path:/tmp/pip-zTDw1t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:34:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:34:12 INFO - Running setup.py (path:/tmp/pip-X4ObRl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:34:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:34:12 INFO - Running setup.py (path:/tmp/pip-9seyoR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:34:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:34:13 INFO - Running setup.py (path:/tmp/pip-2KtdiM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:34:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:34:13 INFO - Running setup.py (path:/tmp/pip-mml6Mx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:34:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:34:13 INFO - Running setup.py (path:/tmp/pip-8_PVc1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:34:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:34:13 INFO - Running setup.py (path:/tmp/pip-OKsrkj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:34:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:34:13 INFO - Running setup.py (path:/tmp/pip-_cZAlM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:34:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:34:13 INFO - Running setup.py (path:/tmp/pip-HZCz0E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:34:13 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 13:34:13 INFO - Running setup.py install for manifestparser 13:34:13 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 13:34:13 INFO - Running setup.py install for mozcrash 13:34:13 INFO - Running setup.py install for mozdebug 13:34:13 INFO - Running setup.py install for mozdevice 13:34:13 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 13:34:13 INFO - Installing dm script to /builds/slave/test/build/venv/bin 13:34:13 INFO - Running setup.py install for mozfile 13:34:13 INFO - Running setup.py install for mozhttpd 13:34:14 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 13:34:14 INFO - Running setup.py install for mozinfo 13:34:14 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 13:34:14 INFO - Running setup.py install for mozInstall 13:34:14 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 13:34:14 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 13:34:14 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 13:34:14 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 13:34:14 INFO - Running setup.py install for mozleak 13:34:14 INFO - Running setup.py install for mozlog 13:34:14 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 13:34:14 INFO - Running setup.py install for moznetwork 13:34:14 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 13:34:14 INFO - Running setup.py install for mozprocess 13:34:14 INFO - Running setup.py install for mozprofile 13:34:14 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 13:34:14 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 13:34:14 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 13:34:14 INFO - Running setup.py install for mozrunner 13:34:14 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 13:34:14 INFO - Running setup.py install for mozscreenshot 13:34:14 INFO - Running setup.py install for moztest 13:34:15 INFO - Running setup.py install for mozversion 13:34:15 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 13:34:15 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 13:34:15 INFO - Cleaning up... 13:34:15 INFO - Return code: 0 13:34:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:34:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:34:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:34:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:15 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 0x7fe09cec1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1d410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cac160>, '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 0x1cad060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1cad4f0>, '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': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', '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 13:34:15 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 13:34:15 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 13:34:15 INFO - Using env: {'DISPLAY': ':0', 13:34:15 INFO - 'HOME': '/home/cltbld', 13:34:15 INFO - 'LANG': 'en_US.UTF-8', 13:34:15 INFO - 'LANGUAGE': 'en_US:en', 13:34:15 INFO - 'LOGNAME': 'cltbld', 13:34:15 INFO - 'MAIL': '/var/mail/cltbld', 13:34:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:34:15 INFO - 'MOZ_NO_REMOTE': '1', 13:34:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:34:15 INFO - 'NO_EM_RESTART': '1', 13:34:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:34:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:34:15 INFO - 'PWD': '/builds/slave/test', 13:34:15 INFO - 'SHELL': '/bin/bash', 13:34:15 INFO - 'SHLVL': '1', 13:34:15 INFO - 'TERM': 'linux', 13:34:15 INFO - 'TMOUT': '86400', 13:34:15 INFO - 'USER': 'cltbld', 13:34:15 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', 13:34:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:34:15 INFO - '_': '/tools/buildbot/bin/python'} 13:34:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:34:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:34:15 INFO - Running setup.py (path:/tmp/pip-3xWj8U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:34:15 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)) 13:34:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:34:15 INFO - Running setup.py (path:/tmp/pip-uLV7ZM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:34:15 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)) 13:34:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:34:15 INFO - Running setup.py (path:/tmp/pip-e65duP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:34:15 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)) 13:34:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:34:15 INFO - Running setup.py (path:/tmp/pip-6hI6sz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:34:15 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)) 13:34:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:34:15 INFO - Running setup.py (path:/tmp/pip-uReUVQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:34:15 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)) 13:34:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:34:15 INFO - Running setup.py (path:/tmp/pip-oXatKQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:34:15 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)) 13:34:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:34:15 INFO - Running setup.py (path:/tmp/pip-9Mv8qa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:34:15 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)) 13:34:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:34:15 INFO - Running setup.py (path:/tmp/pip-haBBDV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:34:16 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)) 13:34:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:34:16 INFO - Running setup.py (path:/tmp/pip-n4TEZl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:34:16 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)) 13:34:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:34:16 INFO - Running setup.py (path:/tmp/pip-i_mcJh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:34:16 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)) 13:34:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:34:16 INFO - Running setup.py (path:/tmp/pip-FmS8pr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:34:16 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)) 13:34:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:34:16 INFO - Running setup.py (path:/tmp/pip-Dcni3M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:34:16 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)) 13:34:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:34:16 INFO - Running setup.py (path:/tmp/pip-XgMWiq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:34:16 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)) 13:34:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:34:16 INFO - Running setup.py (path:/tmp/pip-kQ2F1I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:34:16 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)) 13:34:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:34:16 INFO - Running setup.py (path:/tmp/pip-5lDAu3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:34:16 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)) 13:34:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:34:16 INFO - Running setup.py (path:/tmp/pip-ZqniQW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:34:16 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)) 13:34:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:34:16 INFO - Running setup.py (path:/tmp/pip-XW7Ab3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:34:16 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)) 13:34:16 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)) 13:34:16 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)) 13:34:16 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)) 13:34:16 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)) 13:34:16 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)) 13:34:16 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:34:16 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 13:34:16 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 13:34:16 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 13:34:16 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 13:34:16 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 13:34:16 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 13:34:18 INFO - Downloading blessings-1.6.tar.gz 13:34:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 13:34:18 INFO - Installing collected packages: blessings 13:34:18 INFO - Running setup.py install for blessings 13:34:18 INFO - Successfully installed blessings 13:34:18 INFO - Cleaning up... 13:34:18 INFO - Return code: 0 13:34:18 INFO - Done creating virtualenv /builds/slave/test/build/venv. 13:34:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:34:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:34:19 INFO - Reading from file tmpfile_stdout 13:34:19 INFO - Current package versions: 13:34:19 INFO - argparse == 1.2.1 13:34:19 INFO - blessings == 1.6 13:34:19 INFO - blobuploader == 1.2.4 13:34:19 INFO - docopt == 0.6.1 13:34:19 INFO - manifestparser == 1.1 13:34:19 INFO - mozInstall == 1.12 13:34:19 INFO - mozcrash == 0.17 13:34:19 INFO - mozdebug == 0.1 13:34:19 INFO - mozdevice == 0.48 13:34:19 INFO - mozfile == 1.2 13:34:19 INFO - mozhttpd == 0.7 13:34:19 INFO - mozinfo == 0.9 13:34:19 INFO - mozleak == 0.1 13:34:19 INFO - mozlog == 3.1 13:34:19 INFO - moznetwork == 0.27 13:34:19 INFO - mozprocess == 0.22 13:34:19 INFO - mozprofile == 0.28 13:34:19 INFO - mozrunner == 6.11 13:34:19 INFO - mozscreenshot == 0.1 13:34:19 INFO - mozsystemmonitor == 0.0 13:34:19 INFO - moztest == 0.7 13:34:19 INFO - mozversion == 1.4 13:34:19 INFO - psutil == 3.1.1 13:34:19 INFO - requests == 1.2.3 13:34:19 INFO - wsgiref == 0.1.2 13:34:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:34:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:34:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:34:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:19 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 0x7fe09cec1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1d410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cac160>, '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 0x1cad060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1cad4f0>, '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': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', '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 13:34:19 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 13:34:19 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 13:34:19 INFO - Using env: {'DISPLAY': ':0', 13:34:19 INFO - 'HOME': '/home/cltbld', 13:34:19 INFO - 'LANG': 'en_US.UTF-8', 13:34:19 INFO - 'LANGUAGE': 'en_US:en', 13:34:19 INFO - 'LOGNAME': 'cltbld', 13:34:19 INFO - 'MAIL': '/var/mail/cltbld', 13:34:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:34:19 INFO - 'MOZ_NO_REMOTE': '1', 13:34:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:34:19 INFO - 'NO_EM_RESTART': '1', 13:34:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:34:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:34:19 INFO - 'PWD': '/builds/slave/test', 13:34:19 INFO - 'SHELL': '/bin/bash', 13:34:19 INFO - 'SHLVL': '1', 13:34:19 INFO - 'TERM': 'linux', 13:34:19 INFO - 'TMOUT': '86400', 13:34:19 INFO - 'USER': 'cltbld', 13:34:19 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', 13:34:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:34:19 INFO - '_': '/tools/buildbot/bin/python'} 13:34:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:34:19 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)) 13:34:19 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)) 13:34:19 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)) 13:34:19 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)) 13:34:19 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)) 13:34:19 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)) 13:34:19 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)) 13:34:19 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)) 13:34:19 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)) 13:34:19 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)) 13:34:19 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)) 13:34:19 INFO - Cleaning up... 13:34:19 INFO - Return code: 0 13:34:19 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 13:34:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:34:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:34:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:19 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 0x7fe09cec1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1d410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cac160>, '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 0x1cad060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1cad4f0>, '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': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', '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 13:34:19 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 13:34:19 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 13:34:19 INFO - Using env: {'DISPLAY': ':0', 13:34:19 INFO - 'HOME': '/home/cltbld', 13:34:19 INFO - 'LANG': 'en_US.UTF-8', 13:34:19 INFO - 'LANGUAGE': 'en_US:en', 13:34:19 INFO - 'LOGNAME': 'cltbld', 13:34:19 INFO - 'MAIL': '/var/mail/cltbld', 13:34:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:34:19 INFO - 'MOZ_NO_REMOTE': '1', 13:34:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:34:19 INFO - 'NO_EM_RESTART': '1', 13:34:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:34:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:34:19 INFO - 'PWD': '/builds/slave/test', 13:34:19 INFO - 'SHELL': '/bin/bash', 13:34:19 INFO - 'SHLVL': '1', 13:34:19 INFO - 'TERM': 'linux', 13:34:19 INFO - 'TMOUT': '86400', 13:34:19 INFO - 'USER': 'cltbld', 13:34:19 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', 13:34:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:34:19 INFO - '_': '/tools/buildbot/bin/python'} 13:34:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:34:19 INFO - Downloading/unpacking jsonschema 13:34:19 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 13:34:19 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 13:34:19 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 13:34:19 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 13:34:19 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 13:34:19 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 13:34:21 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 13:34:21 INFO - Downloading/unpacking functools32 (from jsonschema) 13:34:21 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 13:34:21 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 13:34:21 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 13:34:21 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 13:34:21 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 13:34:21 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 13:34:21 INFO - Downloading functools32-3.2.3-2.tar.gz 13:34:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 13:34:21 INFO - warning: no files found matching '*.txt' 13:34:21 INFO - no previously-included directories found matching 'build' 13:34:21 INFO - no previously-included directories found matching 'dist' 13:34:21 INFO - no previously-included directories found matching '.git*' 13:34:21 INFO - Installing collected packages: jsonschema, functools32 13:34:21 INFO - Running setup.py install for functools32 13:34:21 INFO - warning: no files found matching '*.txt' 13:34:21 INFO - no previously-included directories found matching 'build' 13:34:21 INFO - no previously-included directories found matching 'dist' 13:34:21 INFO - no previously-included directories found matching '.git*' 13:34:21 INFO - Successfully installed jsonschema functools32 13:34:21 INFO - Cleaning up... 13:34:21 INFO - Return code: 0 13:34:21 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 13:34:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:34:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:34:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:34:21 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 0x7fe09cec1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c1d410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1cac160>, '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 0x1cad060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1cad4f0>, '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': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', '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 13:34:21 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 13:34:21 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 13:34:21 INFO - Using env: {'DISPLAY': ':0', 13:34:21 INFO - 'HOME': '/home/cltbld', 13:34:21 INFO - 'LANG': 'en_US.UTF-8', 13:34:21 INFO - 'LANGUAGE': 'en_US:en', 13:34:21 INFO - 'LOGNAME': 'cltbld', 13:34:21 INFO - 'MAIL': '/var/mail/cltbld', 13:34:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:34:21 INFO - 'MOZ_NO_REMOTE': '1', 13:34:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:34:21 INFO - 'NO_EM_RESTART': '1', 13:34:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:34:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:34:21 INFO - 'PWD': '/builds/slave/test', 13:34:21 INFO - 'SHELL': '/bin/bash', 13:34:21 INFO - 'SHLVL': '1', 13:34:21 INFO - 'TERM': 'linux', 13:34:21 INFO - 'TMOUT': '86400', 13:34:21 INFO - 'USER': 'cltbld', 13:34:21 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', 13:34:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:34:21 INFO - '_': '/tools/buildbot/bin/python'} 13:34:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:34:22 INFO - Downloading/unpacking flake8 13:34:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:34:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:34:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:34:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:34:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:34:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:34:23 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 13:34:23 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 13:34:23 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 13:34:23 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 13:34:23 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 13:34:23 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 13:34:23 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 13:34:23 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 13:34:24 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 13:34:24 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 13:34:24 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 13:34:24 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 13:34:24 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 13:34:24 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 13:34:24 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 13:34:24 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 13:34:24 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 13:34:24 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 13:34:24 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 13:34:24 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 13:34:24 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 13:34:24 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 13:34:24 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 13:34:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 13:34:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 13:34:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 13:34:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 13:34:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 13:34:24 INFO - no previously-included directories found matching 'docs/_build' 13:34:24 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 13:34:24 INFO - Running setup.py install for pep8 13:34:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 13:34:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 13:34:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 13:34:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 13:34:24 INFO - no previously-included directories found matching 'docs/_build' 13:34:24 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 13:34:24 INFO - Successfully installed flake8 mccabe pyflakes pep8 13:34:24 INFO - Cleaning up... 13:34:25 INFO - Return code: 0 13:34:25 INFO - Running post-action listener: _resource_record_post_action 13:34:25 INFO - Running post-action listener: _start_resource_monitoring 13:34:25 INFO - Starting resource monitoring. 13:34:25 INFO - ##### 13:34:25 INFO - ##### Running install step. 13:34:25 INFO - ##### 13:34:25 INFO - Running pre-action listener: _resource_record_pre_action 13:34:25 INFO - Running main action method: install 13:34:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:34:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:34:25 INFO - Reading from file tmpfile_stdout 13:34:25 INFO - Detecting whether we're running mozinstall >=1.0... 13:34:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 13:34:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 13:34:25 INFO - Reading from file tmpfile_stdout 13:34:25 INFO - Output received: 13:34:25 INFO - Usage: mozinstall [options] installer 13:34:25 INFO - Options: 13:34:25 INFO - -h, --help show this help message and exit 13:34:25 INFO - -d DEST, --destination=DEST 13:34:25 INFO - Directory to install application into. [default: 13:34:25 INFO - "/builds/slave/test"] 13:34:25 INFO - --app=APP Application being installed. [default: firefox] 13:34:25 INFO - mkdir: /builds/slave/test/build/application 13:34:25 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'] 13:34:25 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 13:34:38 INFO - Reading from file tmpfile_stdout 13:34:38 INFO - Output received: 13:34:38 INFO - /builds/slave/test/build/application/firefox/firefox 13:34:38 INFO - Running post-action listener: _resource_record_post_action 13:34:38 INFO - ##### 13:34:38 INFO - ##### Running run-tests step. 13:34:38 INFO - ##### 13:34:38 INFO - Running pre-action listener: _resource_record_pre_action 13:34:38 INFO - Running main action method: run_tests 13:34:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 13:34:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 13:34:38 INFO - Python 2.7.3 13:34:38 INFO - Return code: 0 13:34:38 INFO - grabbing minidump binary from tooltool 13:34:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:34:38 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 0x1cac160>, '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 0x1cad060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1cad4f0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 13:34:38 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 13:34:38 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 13:34:38 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 13:34:38 INFO - Return code: 0 13:34:38 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 13:34:38 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 13:34:38 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 13:34:38 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 13:34:38 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 13:34:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 13:34:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 13:34:39 INFO - Return code: 0 13:34:39 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/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-065', '--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 13:34:39 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/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-065 --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 13:34:39 INFO - Using env: {'DISPLAY': ':0', 13:34:39 INFO - 'HOME': '/home/cltbld', 13:34:39 INFO - 'LANG': 'en_US.UTF-8', 13:34:39 INFO - 'LANGUAGE': 'en_US:en', 13:34:39 INFO - 'LOGNAME': 'cltbld', 13:34:39 INFO - 'MAIL': '/var/mail/cltbld', 13:34:39 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 13:34:39 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 13:34:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:34:39 INFO - 'MOZ_NO_REMOTE': '1', 13:34:39 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 13:34:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:34:39 INFO - 'NO_EM_RESTART': '1', 13:34:39 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:34:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:34:39 INFO - 'PWD': '/builds/slave/test', 13:34:39 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 13:34:39 INFO - 'SHELL': '/bin/bash', 13:34:39 INFO - 'SHLVL': '1', 13:34:39 INFO - 'TERM': 'linux', 13:34:39 INFO - 'TMOUT': '86400', 13:34:39 INFO - 'USER': 'cltbld', 13:34:39 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507', 13:34:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:34:39 INFO - '_': '/tools/buildbot/bin/python'} 13:34:39 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/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-065', '--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 13:34:39 INFO - mozversion application_buildid: 20160425205003 13:34:39 INFO - mozversion application_changeset: 5bbf2e7c2fc6ff9010b1948e2f11477f48ee36e2 13:34:39 INFO - mozversion application_display_name: Firefox 13:34:39 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 13:34:39 INFO - mozversion application_name: Firefox 13:34:39 INFO - mozversion application_remotingname: firefox 13:34:39 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 13:34:39 INFO - mozversion application_vendor: Mozilla 13:34:39 INFO - mozversion application_version: 47.0 13:34:39 INFO - mozversion platform_buildid: 20160425205003 13:34:39 INFO - mozversion platform_changeset: 5bbf2e7c2fc6ff9010b1948e2f11477f48ee36e2 13:34:39 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 13:34:39 INFO - mozversion platform_version: 47.0 13:34:39 INFO - using testdate: 1461702879 13:34:39 INFO - actual date: 1461702879 13:34:39 INFO - starting webserver on 'localhost:57289' 13:34:39 INFO - SUITE-START | Running 2 tests 13:34:39 INFO - TEST-START | dromaeo_css 13:34:39 INFO - operating with platform_type : linux_ 13:34:39 INFO - Initialising browser for dromaeo_css test... 13:34:39 INFO - TEST-INFO | started process 16320 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHkm_QF/profile http://localhost:57289/getInfo.html) 13:34:43 INFO - PROCESS | 16320 | 13:34:43 INFO - PROCESS | 16320 | (process:16395): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:34:44 INFO - PROCESS | 16320 | __metrics Screen width/height:1600/1200 13:34:44 INFO - PROCESS | 16320 | colorDepth:24 13:34:44 INFO - PROCESS | 16320 | Browser inner width/height: 1024/697 13:34:44 INFO - PROCESS | 16320 | __metrics 13:34:44 ERROR - PROCESS | 16320 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 13:34:45 INFO - TEST-INFO | 16320: exit 0 13:34:45 INFO - Browser initialized. 13:34:45 INFO - Running cycle 1/1 for dromaeo_css test... 13:34:45 INFO - TEST-INFO | started process 16445 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHkm_QF/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:34:47 INFO - PROCESS | 16445 | 13:34:47 INFO - PROCESS | 16445 | (process:16514): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:34:57 INFO - PROCESS | 16445 | RSS: Main: 149553152 13:34:57 INFO - PROCESS | 16445 | 13:35:46 INFO - PROCESS | 16445 | 1461702946990 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] 13:37:55 INFO - PROCESS | 16445 | Cycle 1(1): loaded http://localhost:57289/tests/dromaeo/cssquery-dojo.html (next: http://localhost:57289/tests/dromaeo/cssquery-ext.html) 13:37:56 INFO - PROCESS | 16445 | RSS: Main: 153255936 13:37:56 INFO - PROCESS | 16445 | 13:40:58 INFO - PROCESS | 16445 | Cycle 1(1): loaded http://localhost:57289/tests/dromaeo/cssquery-ext.html (next: http://localhost:57289/tests/dromaeo/cssquery-jquery.html) 13:40:58 INFO - PROCESS | 16445 | RSS: Main: 152629248 13:40:58 INFO - PROCESS | 16445 | 13:44:00 INFO - PROCESS | 16445 | Cycle 1(1): loaded http://localhost:57289/tests/dromaeo/cssquery-jquery.html (next: http://localhost:57289/tests/dromaeo/cssquery-mootools.html) 13:44:01 INFO - PROCESS | 16445 | RSS: Main: 151171072 13:44:01 INFO - PROCESS | 16445 | 13:47:02 INFO - PROCESS | 16445 | Cycle 1(1): loaded http://localhost:57289/tests/dromaeo/cssquery-mootools.html (next: http://localhost:57289/tests/dromaeo/cssquery-prototype.html) 13:47:03 INFO - PROCESS | 16445 | RSS: Main: 151973888 13:47:03 INFO - PROCESS | 16445 | 13:50:05 INFO - PROCESS | 16445 | Cycle 1(1): loaded http://localhost:57289/tests/dromaeo/cssquery-prototype.html (next: http://localhost:57289/tests/dromaeo/cssquery-yui.html) 13:50:06 INFO - PROCESS | 16445 | RSS: Main: 150917120 13:50:06 INFO - PROCESS | 16445 | 13:53:08 INFO - PROCESS | 16445 | Cycle 1(1): loaded http://localhost:57289/tests/dromaeo/cssquery-yui.html (next: http://localhost:57289/tests/dromaeo/cssquery-dojo.html) 13:53:08 INFO - PROCESS | 16445 | RSS: Main: 154517504 13:53:08 INFO - PROCESS | 16445 | 13:53:08 INFO - PROCESS | 16445 | __start_tp_report 13:53:08 INFO - PROCESS | 16445 | _x_x_mozilla_page_load 13:53:08 INFO - PROCESS | 16445 | _x_x_mozilla_page_load_details 13:53:08 INFO - PROCESS | 16445 | |i|pagename|runs| 13:53:08 INFO - PROCESS | 16445 | |0;dojo.html;3332.466805311151;3407.710344620707;3420.7947523148614;3451.982740086301;3462.3421549905515;5581.637193582419;5599.664020158793;5604.439556044388;5616.241807356006;5627.324721033482;5607.383187849333;5618.410066942974;5635.774569017245;5637.802676906309;5650.51970582501;5125.871853203663;5170.663906846062;5191.428942816287;5208.218767184933;5229;5058.721770302632;5190.11767999441;5237.240600112981;5241.633085684004;5258.44786297439;5117.104506711329;5151.896962060757;5166.07010738067;5293.073712100367;5350.5452036576935;5201;5206.271122042898;5227.503387178212;5243.9213411798855;5267.683938963674;4823.614110871157;4966.2798894160505;5172.172452407597;5172.250023746573;5253.0544501989625;5320.281761962125;5352.411234764173;5354.089804733205;5357.4374690657305;5360;5913.9112913306335;5936.7031648417405;5956.136360227786;5966.701664916737;6002.159697642333;6055.727492262815;6076.422739839708;6144.832481828438;6149.846253843645;6159.076138579204;5684.54523638108;5685.999999999959;5693;5696.430356964271;5700.486956173922;5980.55145864062;6204.844878877974;6210.5652604317265;6215.782447614311;6240.937590624036;5811.564132690065;5869.765209391662;5888.676122813286;5895.263092113486;5910.527157827363;6082.2701275847185;6087.908681369783;6088.63468191901;6093.055576385579;6109.877802443926;5863.061910094364;5906.173135760997;6043.7884674036195;6055.273367195965;6056.727447264796;6043.3050199227655;6058.1215723719815;6067.848303792441;6068.059450785136;6090.177825993523;4542.523035081335;4572.748498832596;4574.039451715111;4585.197590421662;4612.30815377696;4102.794860256975;4102.938455923164;4126.195391898551;4155.065110350147;4187.539370669224;5658.151277308437;5665.631733937281;5842.649441033552;5869.295684517885;5892.263467066617;6060.696965151725;6087.604305720114;6091.269047714302;6102.9694851525455;6126.785562505291;5574.080276754371;5757.510611598061;5765.88468230633;5779.306483222041;5835.9708201458725;5263;5285;5294.100002999499;5295.576353891679;5309.3894202166475;6271.341509141565;6278.968605157036;6315.084312774622;6330.493560515148;6334.429901308904;5933.495652869555;6066.4540191382985;6118.969405152946;6156.815295541141;6240.4071613196675;6352.777652782131;6356.491480681627;6379.649119298483;6385.010323399881;6388.1376014237485;6034.547408944259;6088.543359248163;6093.786717464867;6094.878102437838;6123.326434092335;5923.318818335774;6126.326104128453;6137.7447333336595;6142.754289828356;6202.7829025985675;5963.940360596339;5993.101034844808;5998.190244317136;5999.610025348338;5999.880002400015;5774.538036957118;5929.762809487572;5967.46292833647;5988.161657368059;5992.64044157352;5771.047777116729;5811.041178205718;5842;5845;5861.35525092248;5899.292084949833;5950.31571369298;5977.9402205977385;5986.4013598639785;5993.80123975198;5714.79998200061;5793.131030345482;5844.649321040752;5845.649261044351;5847.649141051551 13:53:08 INFO - PROCESS | 16445 | |1;ext.html;541.3044238153973;547.2611973835322;569.6354333226735;589.4341432225063;615.3292910727306;38284.617153828454;38912.61087389125;39029.609703902956;39118.41322380167;39135.80432097843;43049.35425968613;43098.35352469715;43349.349759753626;43611.12777744443;43724.344134838;8775.517346545954;8962.238209752179;8966.237869781044;8990.775230619221;9037.864432033524;8725.694600688978;8852.247558957497;8853.645854165825;8860.911390886105;8876.156765107304;9042.638294468246;9092.954535227314;9102.59038343273;9106.408083474586;9122.908770912272;9007.279417646572;9060.04869488704;9107.681231156877;9108.22580080694;9111.179993800557;9172.12864777845;9294.860577091282;9303.069693030642;9320.20778233851;9336.066393360677;44415.77792111051;44769.77615111936;45013.32480012802;45103.77448112739;45228.3215751764;3669.853205871762;3899.902502437433;4261.531231564525;4307.483102027745;4649.373104196118;34132.65867341345;34404.31191376159;34526.48210276848;34778.478322825176;34829.30341393158;4204.726692764961;4332.350147477872;4332.696711230215;4352.89117772055;4360.324149756792;294959;296068.99999999785;297024;297684;298084;65004.67497662576;66259.66870165715;66261.66869165623;66274.66862665655;66333.33666663368;75798;76105.23894761092;76950;77040.61479692566;77128;19480.610387792163;19805.40583782489;19906.104225309897;19944.70082948757;19980.800191998183;15136;15195.772063419057;15214.239288035555;15235.466758663393;15249.771253431207;22774.8861255696;23214.83925803703;23215;23408.76591234066;23431.94556244973;8073.83852322962;8484.745457636282;8578.227959483676;8690.913635795525;8716;1029.9588016479256;1146.873843877173;1187.091874715843;1206.5535751771902;1214.7813393589063;30562.235944101132;30804.383912321628;30815.537766933514;31068.223294417367;31209.687903120677;1075.0163600305789;1095.5891540672249;1135.9318440893574;1154.5324143721807;1162.4478372772865;14625.414983400546;14933.551993440215;15128.697426051418;15498.225088745517;15534.300956456986;318720.21919671225;515854;517317;519549;535770;56764.43235567591;57539;57699.423005770244;57704.71147644319;57936.13095803566;1460.4815290571908;1485.6731519065788;1500.3548474156;1520.9467668631544;1619.3603526606923;29502.409951801274;31655.120242076322;32195.35609287848;32423.189420263738;32997.83501082479;51870.22194667008;52510;52573;52656.736716316176;52840.73579632077;299054;305412;305475;306546;306974;35026.12434689051;35026.82486587551;35279.94160175199;35472.29055418826;35539;47571.28643070426;47714;48244.27633585429;48641.270380945025;49291.26063109128;39458;40065.799671001456;40126.39810402788;40156;40191;38897.24962376643;39057.609423906535;39698.80150599228;40340.193196135326;40862.182756345304;38886.222275554894;39238.215235695694;40203;40246.1950760989;40469;35337.293254135286;35725;36211.63788362188;36387.272254554235;36527.817360913024;27243.182704518895;27324.453510930067;27567.862160689067;27723.861380692968;27781.861090694416 13:53:08 INFO - PROCESS | 16445 | |2;jquery.html;355.3798621405647;376.80217885610045;391.7394932369974;393.98030098495104;400.2095860675167;17930.46208613742;18594.442166735003;18951.241950322004;19452.902735486303;19454.027298635065;11652.708682282948;18278.086095695195;18522.814771852278;18743.531411714714;18768;5064.442911279765;5219.686818790866;5243.030039442715;5256.080185967459;5256.185291279839;5296.602754793386;5509;5521.668699878;5537.916931246034;5561.332640083196;5454.154606036051;5504.559635229172;5523;5856.297244330686;5859.560532960024;5784.421557844224;5789.594728369016;5795.942040579583;5806.680632565207;5846.473817356437;5018.673786203885;5228.163493840967;5254.816081437131;5517.503424691797;5534.142207957773;13138.934305328508;13344.132631378929;13449.798253026212;13616.591502254949;13636.522721704692;2253.188852013274;2318.5131122464304;2395.149721848736;2430.902763889442;2968.495355789521;9603.231741460666;9657.275704322134;9793.167580755644;9888.20894328452;10017.599296028151;1822.070743920597;1871.8596105292158;1885.575745457275;1948.6979518174705;1997.5505511259996;64346.356536434505;65069;65925.06905733;66787.3321266786;67675;9944.303898727165;10279.486025698834;10455.111315538112;10466.11038061758;10501.21240906935;14316.928415358065;14611.196384198971;14634.853651463562;14657.853421465863;14669.266536673123;8126.512409255463;8358.623861926106;8453.830923381498;8478.152184781473;8516.06323304436;8461.23848853606;8488.278496327757;8500.914990850137;8537.146285371537;8573.142685731502;4361.672874534359;4455.1535208310315;4511.075229577928;4524.9547504524535;4597.42532183477;1885.283592234942;1899.8290153886217;1926.5376309685576;1933.7776155741988;1941.3787587971997;942.2838642631649;986.1223511075149;1012.4886932099242;1025.190099821133;1072.6781965410346;17486.562835928948;18046;18610.160044589786;18659.600529960037;18820.717689234672;1013.816615826306;1042.1975079188983;1042.4370839746603;1056.9788604227872;1107.1474964277622;9500.47747373901;9643.517824108907;9783.315167938319;9792.363496372855;9865.950670246602;508854;509856;511789;521956;527110;74836;76909.6154519235;78269;78758.60620696975;82918;1051.7055224537141;1075.0969185883896;1082.9566817327534;1085.8099832529276;1089.0416433538435;16615.3353865844;16691.49925502237;16701.66596668084;16801.831981680516;17092.829071709122;35701.64298356983;36089.45865811963;37030;37046.814765927076;37117.25765484729;48866.5113348862;53671;53701.19448208202;53849.461505384446;53921.730391347795;8179.182081791773;8340.874886876823;8364.289035432057;8388.664453421794;8586.270167035871;9317.021712720067;12551.246925184518;13076.607701768962;13297.002724795873;13555.390007449885;11255.437228138724;11270.887291126985;11583.247088939192;11732.354720490113;11787.587434439753;11418.543258269909;11529.596464123715;11591.188616796744;11670.766584668088;12041.33772642513;12028.338441385458;12073.517059317528;12084.154109212272;12143.271403715806;12208.633740987785;8393.496390216607;8489.40574159803;8507.447015943944;8551.401401901807;8630.050694423733;11687.76624467523;11899.821502677294;11919;11975.461104250155;12021 13:53:08 INFO - PROCESS | 16445 | |3;mootools.html;1650.744134659128;1669.1403926977605;1934.322986954566;2009.136071489259;2011.175418078588;8766.956165219164;8857.822843543125;8938.687145949893;9077.36458447909;9081.318901082412;8969.955150224256;9064.909350906506;9082.273418126551;9092.636294548227;9149.176574108329;2430.805535557151;2453.1414005098163;2454.1778504201116;2466.3834041489627;2467.4078221226955;2467.087177744237;2525.873706314677;2541.7204107548155;2544.9745502545015;2552.412945022646;2443.7189723181796;2457.1031573475643;2496.613024981131;2499.5375855466705;2506.9247922562354;2473.023155853437;2486.254123762864;2495.987520062397;2505.386180385817;2509.4855554611263;2507.2979565721444;2513.5349960257413;2532.3669082729316;2538.5430622487943;2549.54108260513;8991.460512369278;9027.954860225722;9032.27741780656;9056.184943355129;9104.499252541107;5394.973025134888;5533.557315414757;5537.473939975695;5544.306961629796;5550.611457197998;3368.309496553201;3414.5219669246326;3433.896983090486;3444.207832198583;3468.3756923753713;972.1445128287132;1026.1790567546009;1036.922230832683;1037.6575730009079;1055.472263868066;12587.118901676886;12594.181378210387;12651.620451386381;12662;12694.80957785634;4570.765893208882;4714.599259062949;4750.762461876892;4752.429708434941;4766.094442055998;10169.084782369622;10190.541425635864;10202.897971020344;10233.641822536325;10256.435896025641;5444.673319600836;5455.0453670607485;5464.18037294409;5464.371597266365;5486.478784515464;4810.254410566367;5008.924866127011;5015;5048.823291184791;5049.84850454487;3787.886363409102;3849.9807500962315;3865.724310977371;3868.2843673920415;3924.60753924611;1050.5902697947806;1053.6154303679255;1105.5135740274254;1136.794997302845;1162.8778978207336;1467.9119252844864;1491.9627009324636;1506.1113942773816;1508.0273223770607;1532.3181184372847;8684.739457816275;8695.521746303888;8709.782255443537;8722.86915696265;8754.168354006359;532.0609124894564;532.9786808527615;547.6248769592762;548.101114172757;556.1435389500206;6108.694565271719;6117.296510901303;6123.693815309217;6124.877502449926;6178.41305076017;11040.723981900517;11214.719632009102;11267.492962816694;11347.943260283811;11349.659510214708;10819;10999.120070394349;11022;11123.332600044023;11226.831597526043;8567.700130495527;8651.091635378194;8694.391392602583;8719.171678690514;8737.868931965899;7741.07107147146;7798.493097948615;7798.6490607923915;7823.100343460347;7837.647305871135;9776.706698799047;9795.853062204214;9814.85277720849;9867.901320986699;9987.800243995225;9950.701478955643;10012.749681258027;10085.53759704824;10114.089731924161;10137.797244055226;7423.591702456417;7514.248575142442;7581.886271706039;7755.2632499912415;7780.610969451618;8409.327253819558;8418.579071046546;8430.536320502431;8454.492730436194;8486.066532681276;7750.612469376621;7945.404094693036;7969.163237859942;8058.19418058213;8106.148854370206;7784.9610751945875;7786.532808031537;7790.298873101448;7890.881636775568;7984.84030319402;7653.464257501922;8125.349972002344;8193.057798353027;8204.712835050745;8229.053658829072;7308.707651693872;7344.045274114545;7344.816379590553;7365.926340736738;7367.2264412235945;7144.249853765487;7330.157031941182;7406.4074874008875;7433.219511951167;7448.553086814808 13:53:08 INFO - PROCESS | 16445 | |4;prototype.html;342.74123037106983;342.963988781178;351.06091206023893;353.2722591461588;357.24086316577274;6318.968405157973;6320.4943604511645;6429.389208025242;6464.547481676284;6485.383888530594;6341.619502829833;6358.237011558619;6361.968190159054;6381.872362552746;6403.263624683163;4720.763961801913;4826.7827947742435;4828.73441960692;4840.128776820171;4889.6821706589135;4872.537108974641;4892.3639926809465;4901.705897646153;4902.142125128088;4903.019396120772;4846.321514987904;4852.053849499349;4852.757362131897;4853.490383509716;4856.39295088114;4843.612510999129;4857.319975203474;4858.222684370501;4865.270209468573;4869.732164730938;4229.746215227096;4232.78836058199;4233.534311225762;4238.449001629769;4242.172776308621;5932.762689492415;5956.761729530814;6060.939390606081;6064.3935606439445;6070.423309785563;5580.135079062752;5580.246666700024;5582.190582365534;5592.748326325284;5615.185798059259;6697.4261048653525;6730.0577919091365;6737.124173857416;6757.256701762803;6765.898511522331;4628.236341003731;4631.583157515806;4632.768361581908;4641.791119399635;4650.534946505356;7012.544184627983;7014.544054636483;7056.647167641598;7078.858422831515;7092.397146242575;4592.678512504092;4755.904881902343;4756.072565849695;4758.286257061399;4776.450708168536;4860.3195552622665;4877.829275975395;4889.877753056202;4892.951070489249;4909.189983652729;5632.9436705632415;5653.830385088454;5655.858603534863;5656.321241451053;5657.20799088128;6848.246692863781;6856.417204537571;6861;6916.20463646687;6959.095317608679;1690.2647348403484;1745.8079611242754;1747.3098126240318;1748.2307784574746;1751.1331890713923;1109.9889001110048;1115.983260251097;1149.8447709559102;1154.5554961339944;1160.6692092753524;6544.443722283564;6553.377429144223;6555.4427873631275;6557.475401967831;6563.245226798979;7042.295770423019;7059.2234854166;7061.682224299919;7065.752698655522;7067.505274630829;6360.809175724736;6618.30507796684;6631.502637302222;6635.701393437211;6636.270010298863;3817.9427308590393;3847.9807600961817;3854.5567259764925;3855.4024126260474;3857.61423857612;7300.269973002657;7396.96301518489;7405.1854296027395;7408.111026676834;7426.665800039012;7297.124345078519;7303.8539229216185;7308.378787803096;7315.890261646079;7358.337749602454;7093.680784364716;7431.405487560982;7438.181800001996;7463.514871533333;7466.178720340867;7113.0753002109395;7119.359257666835;7134.857302854018;7147.1780745214965;7153.070100887059;7025.402840758388;7044.682989265598;7050.788476345718;7057.894131588133;7067.540609860343;7254.310840470358;7410.444216683878;7422.331990120915;7425.925740742523;7429.4799364044;4723.102610503994;4793.664443489062;4799.424069111729;4800.279958006187;4804.303376010389;7097;7101.893471598033;7134.857302854018;7162.46281528877;7165.928340716526;6900.102986611709;6927.515073944775;6933.653317334214;6939.167299924042;6961.443084553325;6783.491238157257;6925.168979722465;6925.930740692528;6939.30606939302;6940.444764418935;6800.795976120724;6802.82992925161;6813.557118787263;6832.282610325844;6834.214065382345;6925.342092501204;6963.199232088375;6967.965160174167;6970.825729356604;6971.128608923885;6737.764178253738;6738.696758645775;6777.220619628806;6789.93210067893;6790.388865002174 13:53:08 INFO - PROCESS | 16445 | |5;yui.html;893.1961234888599;903.5437104262346;911.7492689510384;928.6981730937445;930.5812384427;14540.27298635068;14749.115053096808;14750.483733069332;17044.82955170448;17420.30318787247;16029.839701602981;16240.350385984577;16280.104594247312;16291.429799957004;16304;916.57379318617;940.0693313619502;940.0975063938627;949.4398305000049;966.2897770138942;967.2165545907802;969.0938972061145;969.8448248280276;971.0435221307007;972.8978457261992;999.1257649556638;999.3304485994365;1001.0540039662521;1003.2676146413123;1005.3917379985077;989.7970915962246;990.8612794208744;992.0823238504355;992.8758905136858;993.2203220471931;714.4427346669606;733.6441825714525;734.1337222077946;734.4528326396816;734.9669264883094;13797.24115173665;13858.722825543533;13863.861361386458;13866.306684665726;13934.372953217027;13249.536266230733;13396.397162127727;13403.86596134036;13480.730385392335;13743.381547830271;11456.4844581994;11515.596954106566;11517.827232591433;11660.533578656843;11846.052315814713;3874.4769456123345;3940.6650434713083;3947.3092208863336;3976.6421022108148;4066.34938409853;45237.32144017842;45927;45958;47829.521704782856;48541.75729121367;10890.237683362247;11018.11855051594;11235.382053986945;11250.268732532359;11376.374299413446;19516.12177452018;19522.316718915055;19779.307724229584;19953.301634442723;20098.79901200969;8401.201885820838;8452.28155606768;8553.957230213933;8575.313974881994;8634.956825215959;4761.928571071437;4845.563899249085;4869.610431165498;5006.4492905780335;5051.974740126276;3411.4541673332146;3455.87904423349;3456.55064841569;3462.770716395694;3474.42671959129;644.7614382678439;668.4284936379423;671.1610486891386;672.4620303756975;675.0751470485467;621.6114928169894;699.7935608995358;719.9208087110413;726.1866709285634;728.2644529025616;8902.910970890338;9056.864147037799;9424.858627120599;9518.619255229713;9618.759531011641;605.4067014325985;709.4678990756933;728.4864170759602;739.9741009064657;742.3949481172826;4248.4052232687445;4286.39990401344;4313.525512193656;4356.6732495063;4403.471583410012;56784.43215567874;57851.132233016535;57954.42045579575;58132.12801807892;58201;50180.498195018314;51751.48248517467;51800;51869.48130518722;54470.182947255824;46444;46993;46995.885185166066;47022.29466558004;48020.27969580459;9227.538623068685;9341.486218258062;9371.344005919793;9588.424694518351;9896.10935015852;34557.82721086378;34775;35220.823895880356;35792.46311305281;35963.46054809232;40789.38815917823;43504.34743478787;43530;43567.34648980205;44130.55869441393;12397.93801030989;12573.057020723665;12631.494740210655;12717.491300347883;12838.422270998015;12116.939415302868;12224.938875305923;12241.510339586317;12305;12808.615741527768;12159.148859579744;12241.938790305992;12308.26150430977;12808.615741527768;12901.290429026494;12168.57409990646;12201.938990304992;12387.07096967749;12744.61766147017;12793.36033198355;12478.18891772032;12536.874631253571;12606.810897836724;12609.621711348675;12840;10328.638497652546;10807.513661885077;11093.611723589636;11251.606193783178;11739.88260117422;10198.796024079329;10976.945115274373;11049.502772375423;11067.446627668745;11292.153088518558 13:53:08 INFO - PROCESS | 16445 | __end_tp_report 13:53:08 INFO - PROCESS | 16445 | __start_cc_report 13:53:08 INFO - PROCESS | 16445 | _x_x_mozilla_cycle_collect,333 13:53:08 INFO - PROCESS | 16445 | __end_cc_report 13:53:08 INFO - PROCESS | 16445 | __startTimestamp1461703988521__endTimestamp 13:53:08 INFO - PROCESS | 16445 | 13:53:08 INFO - PROCESS | 16445 | ------- Summary: start ------- 13:53:08 INFO - PROCESS | 16445 | Number of tests: 6 13:53:08 INFO - PROCESS | 16445 | 13:53:08 INFO - PROCESS | 16445 | [#0] dojo.html Cycles:165 Average:5635.60 Median:5845.65 stddev:632.78 (10.8%) stddev-sans-first:608.38 13:53:08 INFO - PROCESS | 16445 | Values: 3332.5 3407.7 3420.8 3452.0 3462.3 5581.6 5599.7 5604.4 5616.2 5627.3 5607.4 5618.4 5635.8 5637.8 5650.5 5125.9 5170.7 5191.4 5208.2 5229.0 5058.7 5190.1 5237.2 5241.6 5258.4 5117.1 5151.9 5166.1 5293.1 5350.5 5201.0 5206.3 5227.5 5243.9 5267.7 4823.6 4966.3 5172.2 5172.3 5253.1 5320.3 5352.4 5354.1 5357.4 5360.0 5913.9 5936.7 5956.1 5966.7 6002.2 6055.7 6076.4 6144.8 6149.8 6159.1 5684.5 5686.0 5693.0 5696.4 5700.5 5980.6 6204.8 6210.6 6215.8 6240.9 5811.6 5869.8 5888.7 5895.3 5910.5 6082.3 6087.9 6088.6 6093.1 6109.9 5863.1 5906.2 6043.8 6055.3 6056.7 6043.3 6058.1 6067.8 6068.1 6090.2 4542.5 4572.7 4574.0 4585.2 4612.3 4102.8 4102.9 4126.2 4155.1 4187.5 5658.2 5665.6 5842.6 5869.3 5892.3 6060.7 6087.6 6091.3 6103.0 6126.8 5574.1 5757.5 5765.9 5779.3 5836.0 5263.0 5285.0 5294.1 5295.6 5309.4 6271.3 6279.0 6315.1 6330.5 6334.4 5933.5 6066.5 6119.0 6156.8 6240.4 6352.8 6356.5 6379.6 6385.0 6388.1 6034.5 6088.5 6093.8 6094.9 6123.3 5923.3 6126.3 6137.7 6142.8 6202.8 5963.9 5993.1 5998.2 5999.6 5999.9 5774.5 5929.8 5967.5 5988.2 5992.6 5771.0 5811.0 5842.0 5845.0 5861.4 5899.3 5950.3 5977.9 5986.4 5993.8 5714.8 5793.1 5844.6 5845.6 5847.6 13:53:08 INFO - PROCESS | 16445 | 13:53:08 INFO - PROCESS | 16445 | [#1] ext.html Cycles:180 Average:54627.23 Median:40141.20 stddev:98752.13 (246.0%) stddev-sans-first:98945.66 13:53:08 INFO - PROCESS | 16445 | Values: 541.3 547.3 569.6 589.4 615.3 38284.6 38912.6 39029.6 39118.4 39135.8 43049.4 43098.4 43349.3 43611.1 43724.3 8775.5 8962.2 8966.2 8990.8 9037.9 8725.7 8852.2 8853.6 8860.9 8876.2 9042.6 9093.0 9102.6 9106.4 9122.9 9007.3 9060.0 9107.7 9108.2 9111.2 9172.1 9294.9 9303.1 9320.2 9336.1 44415.8 44769.8 45013.3 45103.8 45228.3 3669.9 3899.9 4261.5 4307.5 4649.4 34132.7 34404.3 34526.5 34778.5 34829.3 4204.7 4332.4 4332.7 4352.9 4360.3 294959.0 296069.0 297024.0 297684.0 298084.0 65004.7 66259.7 66261.7 66274.7 66333.3 75798.0 76105.2 76950.0 77040.6 77128.0 19480.6 19805.4 19906.1 19944.7 19980.8 15136.0 15195.8 15214.2 15235.5 15249.8 22774.9 23214.8 23215.0 23408.8 23431.9 8073.8 8484.7 8578.2 8690.9 8716.0 1030.0 1146.9 1187.1 1206.6 1214.8 30562.2 30804.4 30815.5 31068.2 31209.7 1075.0 1095.6 1135.9 1154.5 1162.4 14625.4 14933.6 15128.7 15498.2 15534.3 318720.2 515854.0 517317.0 519549.0 535770.0 56764.4 57539.0 57699.4 57704.7 57936.1 1460.5 1485.7 1500.4 1520.9 1619.4 29502.4 31655.1 32195.4 32423.2 32997.8 51870.2 52510.0 52573.0 52656.7 52840.7 299054.0 305412.0 305475.0 306546.0 306974.0 35026.1 35026.8 35279.9 35472.3 35539.0 47571.3 47714.0 48244.3 48641.3 49291.3 39458.0 40065.8 40126.4 40156.0 40191.0 38897.2 39057.6 39698.8 40340.2 40862.2 38886.2 39238.2 40203.0 40246.2 40469.0 35337.3 35725.0 36211.6 36387.3 36527.8 27243.2 27324.5 27567.9 27723.9 27781.9 13:53:08 INFO - PROCESS | 16445 | 13:53:08 INFO - PROCESS | 16445 | [#2] jquery.html Cycles:180 Average:28158.96 Median:37038.41 stddev:84472.59 (228.1%) stddev-sans-first:84683.76 13:53:08 INFO - PROCESS | 16445 | Values: 355.4 376.8 391.7 394.0 400.2 17930.5 18594.4 18951.2 19452.9 19454.0 11652.7 18278.1 18522.8 18743.5 18768.0 5064.4 5219.7 5243.0 5256.1 5256.2 5296.6 5509.0 5521.7 5537.9 5561.3 5454.2 5504.6 5523.0 5856.3 5859.6 5784.4 5789.6 5795.9 5806.7 5846.5 5018.7 5228.2 5254.8 5517.5 5534.1 13138.9 13344.1 13449.8 13616.6 13636.5 2253.2 2318.5 2395.1 2430.9 2968.5 9603.2 9657.3 9793.2 9888.2 10017.6 1822.1 1871.9 1885.6 1948.7 1997.6 64346.4 65069.0 65925.1 66787.3 67675.0 9944.3 10279.5 10455.1 10466.1 10501.2 14316.9 14611.2 14634.9 14657.9 14669.3 8126.5 8358.6 8453.8 8478.2 8516.1 8461.2 8488.3 8500.9 8537.1 8573.1 4361.7 4455.2 4511.1 4525.0 4597.4 1885.3 1899.8 1926.5 1933.8 1941.4 942.3 986.1 1012.5 1025.2 1072.7 17486.6 18046.0 18610.2 18659.6 18820.7 1013.8 1042.2 1042.4 1057.0 1107.1 9500.5 9643.5 9783.3 9792.4 9866.0 508854.0 509856.0 511789.0 521956.0 527110.0 74836.0 76909.6 78269.0 78758.6 82918.0 1051.7 1075.1 1083.0 1085.8 1089.0 16615.3 16691.5 16701.7 16801.8 17092.8 35701.6 36089.5 37030.0 37046.8 37117.3 48866.5 53671.0 53701.2 53849.5 53921.7 8179.2 8340.9 8364.3 8388.7 8586.3 9317.0 12551.2 13076.6 13297.0 13555.4 11255.4 11270.9 11583.2 11732.4 11787.6 11418.5 11529.6 11591.2 11670.8 12041.3 12028.3 12073.5 12084.2 12143.3 12208.6 8393.5 8489.4 8507.4 8551.4 8630.1 11687.8 11899.8 11919.0 11975.5 12021.0 13:53:08 INFO - PROCESS | 16445 | 13:53:08 INFO - PROCESS | 16445 | [#3] mootools.html Cycles:180 Average:6236.91 Median:5419.82 stddev:3362.73 (62.0%) stddev-sans-first:3354.50 13:53:08 INFO - PROCESS | 16445 | Values: 1650.7 1669.1 1934.3 2009.1 2011.2 8767.0 8857.8 8938.7 9077.4 9081.3 8970.0 9064.9 9082.3 9092.6 9149.2 2430.8 2453.1 2454.2 2466.4 2467.4 2467.1 2525.9 2541.7 2545.0 2552.4 2443.7 2457.1 2496.6 2499.5 2506.9 2473.0 2486.3 2496.0 2505.4 2509.5 2507.3 2513.5 2532.4 2538.5 2549.5 8991.5 9028.0 9032.3 9056.2 9104.5 5395.0 5533.6 5537.5 5544.3 5550.6 3368.3 3414.5 3433.9 3444.2 3468.4 972.1 1026.2 1036.9 1037.7 1055.5 12587.1 12594.2 12651.6 12662.0 12694.8 4570.8 4714.6 4750.8 4752.4 4766.1 10169.1 10190.5 10202.9 10233.6 10256.4 5444.7 5455.0 5464.2 5464.4 5486.5 4810.3 5008.9 5015.0 5048.8 5049.8 3787.9 3850.0 3865.7 3868.3 3924.6 1050.6 1053.6 1105.5 1136.8 1162.9 1467.9 1492.0 1506.1 1508.0 1532.3 8684.7 8695.5 8709.8 8722.9 8754.2 532.1 533.0 547.6 548.1 556.1 6108.7 6117.3 6123.7 6124.9 6178.4 11040.7 11214.7 11267.5 11347.9 11349.7 10819.0 10999.1 11022.0 11123.3 11226.8 8567.7 8651.1 8694.4 8719.2 8737.9 7741.1 7798.5 7798.6 7823.1 7837.6 9776.7 9795.9 9814.9 9867.9 9987.8 9950.7 10012.7 10085.5 10114.1 10137.8 7423.6 7514.2 7581.9 7755.3 7780.6 8409.3 8418.6 8430.5 8454.5 8486.1 7750.6 7945.4 7969.2 8058.2 8106.1 7785.0 7786.5 7790.3 7890.9 7984.8 7653.5 8125.3 8193.1 8204.7 8229.1 7308.7 7344.0 7344.8 7365.9 7367.2 7144.2 7330.2 7406.4 7433.2 7448.6 13:53:08 INFO - PROCESS | 16445 | 13:53:08 INFO - PROCESS | 16445 | [#4] prototype.html Cycles:180 Average:5717.55 Median:6514.91 stddev:1752.27 (26.9%) stddev-sans-first:1710.12 13:53:08 INFO - PROCESS | 16445 | Values: 342.7 343.0 351.1 353.3 357.2 6319.0 6320.5 6429.4 6464.5 6485.4 6341.6 6358.2 6362.0 6381.9 6403.3 4720.8 4826.8 4828.7 4840.1 4889.7 4872.5 4892.4 4901.7 4902.1 4903.0 4846.3 4852.1 4852.8 4853.5 4856.4 4843.6 4857.3 4858.2 4865.3 4869.7 4229.7 4232.8 4233.5 4238.4 4242.2 5932.8 5956.8 6060.9 6064.4 6070.4 5580.1 5580.2 5582.2 5592.7 5615.2 6697.4 6730.1 6737.1 6757.3 6765.9 4628.2 4631.6 4632.8 4641.8 4650.5 7012.5 7014.5 7056.6 7078.9 7092.4 4592.7 4755.9 4756.1 4758.3 4776.5 4860.3 4877.8 4889.9 4893.0 4909.2 5632.9 5653.8 5655.9 5656.3 5657.2 6848.2 6856.4 6861.0 6916.2 6959.1 1690.3 1745.8 1747.3 1748.2 1751.1 1110.0 1116.0 1149.8 1154.6 1160.7 6544.4 6553.4 6555.4 6557.5 6563.2 7042.3 7059.2 7061.7 7065.8 7067.5 6360.8 6618.3 6631.5 6635.7 6636.3 3817.9 3848.0 3854.6 3855.4 3857.6 7300.3 7397.0 7405.2 7408.1 7426.7 7297.1 7303.9 7308.4 7315.9 7358.3 7093.7 7431.4 7438.2 7463.5 7466.2 7113.1 7119.4 7134.9 7147.2 7153.1 7025.4 7044.7 7050.8 7057.9 7067.5 7254.3 7410.4 7422.3 7425.9 7429.5 4723.1 4793.7 4799.4 4800.3 4804.3 7097.0 7101.9 7134.9 7162.5 7165.9 6900.1 6927.5 6933.7 6939.2 6961.4 6783.5 6925.2 6925.9 6939.3 6940.4 6800.8 6802.8 6813.6 6832.3 6834.2 6925.3 6963.2 6968.0 6970.8 6971.1 6737.8 6738.7 6777.2 6789.9 6790.4 13:53:08 INFO - PROCESS | 16445 | 13:53:08 INFO - PROCESS | 16445 | [#5] yui.html Cycles:180 Average:14438.90 Median:4299.96 stddev:15793.71 (367.3%) stddev-sans-first:15805.25 13:53:08 INFO - PROCESS | 16445 | Values: 893.2 903.5 911.7 928.7 930.6 14540.3 14749.1 14750.5 17044.8 17420.3 16029.8 16240.4 16280.1 16291.4 16304.0 916.6 940.1 940.1 949.4 966.3 967.2 969.1 969.8 971.0 972.9 999.1 999.3 1001.1 1003.3 1005.4 989.8 990.9 992.1 992.9 993.2 714.4 733.6 734.1 734.5 735.0 13797.2 13858.7 13863.9 13866.3 13934.4 13249.5 13396.4 13403.9 13480.7 13743.4 11456.5 11515.6 11517.8 11660.5 11846.1 3874.5 3940.7 3947.3 3976.6 4066.3 45237.3 45927.0 45958.0 47829.5 48541.8 10890.2 11018.1 11235.4 11250.3 11376.4 19516.1 19522.3 19779.3 19953.3 20098.8 8401.2 8452.3 8554.0 8575.3 8635.0 4761.9 4845.6 4869.6 5006.4 5052.0 3411.5 3455.9 3456.6 3462.8 3474.4 644.8 668.4 671.2 672.5 675.1 621.6 699.8 719.9 726.2 728.3 8902.9 9056.9 9424.9 9518.6 9618.8 605.4 709.5 728.5 740.0 742.4 4248.4 4286.4 4313.5 4356.7 4403.5 56784.4 57851.1 57954.4 58132.1 58201.0 50180.5 51751.5 51800.0 51869.5 54470.2 46444.0 46993.0 46995.9 47022.3 48020.3 9227.5 9341.5 9371.3 9588.4 9896.1 34557.8 34775.0 35220.8 35792.5 35963.5 40789.4 43504.3 43530.0 43567.3 44130.6 12397.9 12573.1 12631.5 12717.5 12838.4 12116.9 12224.9 12241.5 12305.0 12808.6 12159.1 12241.9 12308.3 12808.6 12901.3 12168.6 12201.9 12387.1 12744.6 12793.4 12478.2 12536.9 12606.8 12609.6 12840.0 10328.6 10807.5 11093.6 11251.6 11739.9 10198.8 10976.9 11049.5 11067.4 11292.2 13:53:08 INFO - PROCESS | 16445 | -------- Summary: end -------- 13:53:08 INFO - PROCESS | 16445 | 13:53:09 INFO - TEST-INFO | 16445: exit 0 13:53:09 INFO - TEST-OK | dromaeo_css | took 1109389ms 13:53:09 INFO - TEST-START | kraken 13:53:09 INFO - operating with platform_type : linux_ 13:53:09 INFO - Initialising browser for kraken test... 13:53:09 INFO - TEST-INFO | started process 16688 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpZjwoBw/profile http://localhost:57289/getInfo.html) 13:53:12 INFO - PROCESS | 16688 | 13:53:12 INFO - PROCESS | 16688 | (process:16764): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:53:13 INFO - PROCESS | 16688 | __metrics Screen width/height:1600/1200 13:53:13 INFO - PROCESS | 16688 | colorDepth:24 13:53:13 INFO - PROCESS | 16688 | Browser inner width/height: 1024/697 13:53:13 INFO - PROCESS | 16688 | __metrics 13:53:14 ERROR - PROCESS | 16688 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 13:53:14 INFO - TEST-INFO | 16688: exit 0 13:53:14 INFO - Browser initialized. 13:53:14 INFO - Running cycle 1/1 for kraken test... 13:53:14 INFO - TEST-INFO | started process 16814 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpZjwoBw/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:53:16 INFO - PROCESS | 16814 | 13:53:16 INFO - PROCESS | 16814 | (process:16881): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:53:26 INFO - PROCESS | 16814 | RSS: Main: 149635072 13:53:26 INFO - PROCESS | 16814 | 13:53:29 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:57289/tests/kraken/driver.html?testName=audio-beat-detection) 13:53:29 INFO - PROCESS | 16814 | RSS: Main: 154464256 13:53:29 INFO - PROCESS | 16814 | 13:53:32 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:57289/tests/kraken/driver.html?testName=audio-dft) 13:53:33 INFO - PROCESS | 16814 | RSS: Main: 154595328 13:53:33 INFO - PROCESS | 16814 | 13:53:36 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:57289/tests/kraken/driver.html?testName=audio-fft) 13:53:36 INFO - PROCESS | 16814 | RSS: Main: 154841088 13:53:36 INFO - PROCESS | 16814 | 13:53:38 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:57289/tests/kraken/driver.html?testName=audio-oscillator) 13:53:39 INFO - PROCESS | 16814 | RSS: Main: 155111424 13:53:39 INFO - PROCESS | 16814 | 13:53:41 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:57289/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:53:42 INFO - PROCESS | 16814 | RSS: Main: 154644480 13:53:42 INFO - PROCESS | 16814 | 13:53:45 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:57289/tests/kraken/driver.html?testName=imaging-darkroom) 13:53:45 INFO - PROCESS | 16814 | RSS: Main: 154685440 13:53:45 INFO - PROCESS | 16814 | 13:53:49 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:57289/tests/kraken/driver.html?testName=imaging-desaturate) 13:53:49 INFO - PROCESS | 16814 | RSS: Main: 154808320 13:53:49 INFO - PROCESS | 16814 | 13:53:52 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:57289/tests/kraken/driver.html?testName=json-parse-financial) 13:53:53 INFO - PROCESS | 16814 | RSS: Main: 155308032 13:53:53 INFO - PROCESS | 16814 | 13:53:54 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:57289/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:53:55 INFO - PROCESS | 16814 | RSS: Main: 155127808 13:53:55 INFO - PROCESS | 16814 | 13:53:57 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:57289/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:53:57 INFO - PROCESS | 16814 | RSS: Main: 155029504 13:53:57 INFO - PROCESS | 16814 | 13:53:59 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:57289/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:54:00 INFO - PROCESS | 16814 | RSS: Main: 155377664 13:54:00 INFO - PROCESS | 16814 | 13:54:02 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:57289/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:54:03 INFO - PROCESS | 16814 | RSS: Main: 155480064 13:54:03 INFO - PROCESS | 16814 | 13:54:05 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:57289/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:54:06 INFO - PROCESS | 16814 | RSS: Main: 155246592 13:54:06 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | Cycle 1(1): loaded http://localhost:57289/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:57289/tests/kraken/driver.html?testName=ai-astar) 13:54:08 INFO - PROCESS | 16814 | RSS: Main: 157184000 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | __start_tp_report 13:54:08 INFO - PROCESS | 16814 | _x_x_mozilla_page_load 13:54:08 INFO - PROCESS | 16814 | _x_x_mozilla_page_load_details 13:54:08 INFO - PROCESS | 16814 | |i|pagename|runs| 13:54:08 INFO - PROCESS | 16814 | |0;ai-astar;112;104;111;112;111;122;110;111;112;112 13:54:08 INFO - PROCESS | 16814 | |1;audio-beat-detection;156;129;156;172;130;160;157;131;177;129 13:54:08 INFO - PROCESS | 16814 | |2;audio-dft;163;162;163;163;163;161;161;162;166;162 13:54:08 INFO - PROCESS | 16814 | |3;audio-fft;77;77;75;160;77;75;73;77;166;77 13:54:08 INFO - PROCESS | 16814 | |4;audio-oscillator;93;93;144;93;95;92;148;92;94;143 13:54:08 INFO - PROCESS | 16814 | |5;imaging-gaussian-blur;117;118;118;117;117;118;117;118;119;119 13:54:08 INFO - PROCESS | 16814 | |6;imaging-darkroom;149;146;147;147;147;147;147;146;148;147 13:54:08 INFO - PROCESS | 16814 | |7;imaging-desaturate;96;96;96;97;97;96;96;96;96;95 13:54:08 INFO - PROCESS | 16814 | |8;json-parse-financial;60;58;58;58;58;60;58;70;56;55 13:54:08 INFO - PROCESS | 16814 | |9;json-stringify-tinderbox;72;76;77;75;72;73;72;72;72;72 13:54:08 INFO - PROCESS | 16814 | |10;stanford-crypto-aes;79;79;78;86;79;80;86;78;80;80 13:54:08 INFO - PROCESS | 16814 | |11;stanford-crypto-ccm;117;114;117;125;117;120;118;125;115;119 13:54:08 INFO - PROCESS | 16814 | |12;stanford-crypto-pbkdf2;138;149;148;139;151;138;146;147;148;136 13:54:08 INFO - PROCESS | 16814 | |13;stanford-crypto-sha256-iterative;67;68;67;70;71;78;71;67;71;66 13:54:08 INFO - PROCESS | 16814 | __end_tp_report 13:54:08 INFO - PROCESS | 16814 | __start_cc_report 13:54:08 INFO - PROCESS | 16814 | _x_x_mozilla_cycle_collect,827 13:54:08 INFO - PROCESS | 16814 | __end_cc_report 13:54:08 INFO - PROCESS | 16814 | __startTimestamp1461704048542__endTimestamp 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | ------- Summary: start ------- 13:54:08 INFO - PROCESS | 16814 | Number of tests: 14 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#0] ai-astar Cycles:10 Average:111.70 Median:112.00 stddev:4.35 (3.9%) stddev-sans-first:4.61 13:54:08 INFO - PROCESS | 16814 | Values: 112.0 104.0 111.0 112.0 111.0 122.0 110.0 111.0 112.0 112.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#1] audio-beat-detection Cycles:10 Average:149.70 Median:156.50 stddev:18.49 (11.8%) stddev-sans-first:19.47 13:54:08 INFO - PROCESS | 16814 | Values: 156.0 129.0 156.0 172.0 130.0 160.0 157.0 131.0 177.0 129.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#2] audio-dft Cycles:10 Average:162.60 Median:163.00 stddev:1.43 (0.9%) stddev-sans-first:1.51 13:54:08 INFO - PROCESS | 16814 | Values: 163.0 162.0 163.0 163.0 163.0 161.0 161.0 162.0 166.0 162.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#3] audio-fft Cycles:10 Average:93.40 Median:77.00 stddev:36.73 (47.7%) stddev-sans-first:38.48 13:54:08 INFO - PROCESS | 16814 | Values: 77.0 77.0 75.0 160.0 77.0 75.0 73.0 77.0 166.0 77.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#4] audio-oscillator Cycles:10 Average:108.70 Median:93.00 stddev:25.10 (27.0%) stddev-sans-first:25.97 13:54:08 INFO - PROCESS | 16814 | Values: 93.0 93.0 144.0 93.0 95.0 92.0 148.0 92.0 94.0 143.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#5] imaging-gaussian-blur Cycles:10 Average:117.80 Median:118.00 stddev:0.79 (0.7%) stddev-sans-first:0.78 13:54:08 INFO - PROCESS | 16814 | Values: 117.0 118.0 118.0 117.0 117.0 118.0 117.0 118.0 119.0 119.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#6] imaging-darkroom Cycles:10 Average:147.10 Median:147.00 stddev:0.88 (0.6%) stddev-sans-first:0.60 13:54:08 INFO - PROCESS | 16814 | Values: 149.0 146.0 147.0 147.0 147.0 147.0 147.0 146.0 148.0 147.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#7] imaging-desaturate Cycles:10 Average:96.10 Median:96.00 stddev:0.57 (0.6%) stddev-sans-first:0.60 13:54:08 INFO - PROCESS | 16814 | Values: 96.0 96.0 96.0 97.0 97.0 96.0 96.0 96.0 96.0 95.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#8] json-parse-financial Cycles:10 Average:59.10 Median:58.00 stddev:4.12 (7.1%) stddev-sans-first:4.36 13:54:08 INFO - PROCESS | 16814 | Values: 60.0 58.0 58.0 58.0 58.0 60.0 58.0 70.0 56.0 55.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#9] json-stringify-tinderbox Cycles:10 Average:73.30 Median:72.50 stddev:1.95 (2.7%) stddev-sans-first:2.01 13:54:08 INFO - PROCESS | 16814 | Values: 72.0 76.0 77.0 75.0 72.0 73.0 72.0 72.0 72.0 72.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#10] stanford-crypto-aes Cycles:10 Average:80.50 Median:80.00 stddev:2.99 (3.7%) stddev-sans-first:3.12 13:54:08 INFO - PROCESS | 16814 | Values: 79.0 79.0 78.0 86.0 79.0 80.0 86.0 78.0 80.0 80.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#11] stanford-crypto-ccm Cycles:10 Average:118.70 Median:118.50 stddev:3.74 (3.2%) stddev-sans-first:3.92 13:54:08 INFO - PROCESS | 16814 | Values: 117.0 114.0 117.0 125.0 117.0 120.0 118.0 125.0 115.0 119.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:144.00 Median:147.50 stddev:5.58 (3.8%) stddev-sans-first:5.48 13:54:08 INFO - PROCESS | 16814 | Values: 138.0 149.0 148.0 139.0 151.0 138.0 146.0 147.0 148.0 136.0 13:54:08 INFO - PROCESS | 16814 | 13:54:08 INFO - PROCESS | 16814 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.60 Median:70.50 stddev:3.53 (5.0%) stddev-sans-first:3.62 13:54:08 INFO - PROCESS | 16814 | Values: 67.0 68.0 67.0 70.0 71.0 78.0 71.0 67.0 71.0 66.0 13:54:08 INFO - PROCESS | 16814 | -------- Summary: end -------- 13:54:08 INFO - PROCESS | 16814 | 13:54:09 INFO - TEST-INFO | 16814: exit 0 13:54:09 INFO - TEST-OK | kraken | took 60226ms 13:54:09 INFO - SUITE-END | took 1169s 13:54:09 INFO - Completed test suite (00:19:29) 13:54:09 INFO - javascript benchmark 13:54:09 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3332.466805311151, 3407.710344620707, 3420.7947523148614, 3451.982740086301, 3462.3421549905515, 5581.637193582419, 5599.664020158793, 5604.439556044388, 5616.241807356006, 5627.324721033482, 5607.383187849333, 5618.410066942974, 5635.774569017245, 5637.802676906309, 5650.51970582501, 5125.871853203663, 5170.663906846062, 5191.428942816287, 5208.218767184933, 5229.0, 5058.721770302632, 5190.11767999441, 5237.240600112981, 5241.633085684004, 5258.44786297439, 5117.104506711329, 5151.896962060757, 5166.07010738067, 5293.073712100367, 5350.5452036576935, 5201.0, 5206.271122042898, 5227.503387178212, 5243.9213411798855, 5267.683938963674, 4823.614110871157, 4966.2798894160505, 5172.172452407597, 5172.250023746573, 5253.0544501989625, 5320.281761962125, 5352.411234764173, 5354.089804733205, 5357.4374690657305, 5360.0, 5913.9112913306335, 5936.7031648417405, 5956.136360227786, 5966.701664916737, 6002.159697642333, 6055.727492262815, 6076.422739839708, 6144.832481828438, 6149.846253843645, 6159.076138579204, 5684.54523638108, 5685.999999999959, 5693.0, 5696.430356964271, 5700.486956173922, 5980.55145864062, 6204.844878877974, 6210.5652604317265, 6215.782447614311, 6240.937590624036, 5811.564132690065, 5869.765209391662, 5888.676122813286, 5895.263092113486, 5910.527157827363, 6082.2701275847185, 6087.908681369783, 6088.63468191901, 6093.055576385579, 6109.877802443926, 5863.061910094364, 5906.173135760997, 6043.7884674036195, 6055.273367195965, 6056.727447264796, 6043.3050199227655, 6058.1215723719815, 6067.848303792441, 6068.059450785136, 6090.177825993523, 4542.523035081335, 4572.748498832596, 4574.039451715111, 4585.197590421662, 4612.30815377696, 4102.794860256975, 4102.938455923164, 4126.195391898551, 4155.065110350147, 4187.539370669224, 5658.151277308437, 5665.631733937281, 5842.649441033552, 5869.295684517885, 5892.263467066617, 6060.696965151725, 6087.604305720114, 6091.269047714302, 6102.9694851525455, 6126.785562505291, 5574.080276754371, 5757.510611598061, 5765.88468230633, 5779.306483222041, 5835.9708201458725, 5263.0, 5285.0, 5294.100002999499, 5295.576353891679, 5309.3894202166475, 6271.341509141565, 6278.968605157036, 6315.084312774622, 6330.493560515148, 6334.429901308904, 5933.495652869555, 6066.4540191382985, 6118.969405152946, 6156.815295541141, 6240.4071613196675, 6352.777652782131, 6356.491480681627, 6379.649119298483, 6385.010323399881, 6388.1376014237485, 6034.547408944259, 6088.543359248163, 6093.786717464867, 6094.878102437838, 6123.326434092335, 5923.318818335774, 6126.326104128453, 6137.7447333336595, 6142.754289828356, 6202.7829025985675, 5963.940360596339, 5993.101034844808, 5998.190244317136, 5999.610025348338, 5999.880002400015, 5774.538036957118, 5929.762809487572, 5967.46292833647, 5988.161657368059, 5992.64044157352, 5771.047777116729, 5811.041178205718, 5842.0, 5845.0, 5861.35525092248, 5899.292084949833, 5950.31571369298, 5977.9402205977385, 5986.4013598639785, 5993.80123975198, 5714.79998200061, 5793.131030345482, 5844.649321040752, 5845.649261044351, 5847.649141051551], "unit": "score", "name": "dojo.html", "value": 5594.307626368015}, {"lowerIsBetter": false, "replicates": [541.3044238153973, 547.2611973835322, 569.6354333226735, 589.4341432225063, 615.3292910727306, 38284.617153828454, 38912.61087389125, 39029.609703902956, 39118.41322380167, 39135.80432097843, 43049.35425968613, 43098.35352469715, 43349.349759753626, 43611.12777744443, 43724.344134838, 8775.517346545954, 8962.238209752179, 8966.237869781044, 8990.775230619221, 9037.864432033524, 8725.694600688978, 8852.247558957497, 8853.645854165825, 8860.911390886105, 8876.156765107304, 9042.638294468246, 9092.954535227314, 9102.59038343273, 9106.408083474586, 9122.908770912272, 9007.279417646572, 9060.04869488704, 9107.681231156877, 9108.22580080694, 9111.179993800557, 9172.12864777845, 9294.860577091282, 9303.069693030642, 9320.20778233851, 9336.066393360677, 44415.77792111051, 44769.77615111936, 45013.32480012802, 45103.77448112739, 45228.3215751764, 3669.853205871762, 3899.902502437433, 4261.531231564525, 4307.483102027745, 4649.373104196118, 34132.65867341345, 34404.31191376159, 34526.48210276848, 34778.478322825176, 34829.30341393158, 4204.726692764961, 4332.350147477872, 4332.696711230215, 4352.89117772055, 4360.324149756792, 294959.0, 296068.99999999785, 297024.0, 297684.0, 298084.0, 65004.67497662576, 66259.66870165715, 66261.66869165623, 66274.66862665655, 66333.33666663368, 75798.0, 76105.23894761092, 76950.0, 77040.61479692566, 77128.0, 19480.610387792163, 19805.40583782489, 19906.104225309897, 19944.70082948757, 19980.800191998183, 15136.0, 15195.772063419057, 15214.239288035555, 15235.466758663393, 15249.771253431207, 22774.8861255696, 23214.83925803703, 23215.0, 23408.76591234066, 23431.94556244973, 8073.83852322962, 8484.745457636282, 8578.227959483676, 8690.913635795525, 8716.0, 1029.9588016479256, 1146.873843877173, 1187.091874715843, 1206.5535751771902, 1214.7813393589063, 30562.235944101132, 30804.383912321628, 30815.537766933514, 31068.223294417367, 31209.687903120677, 1075.0163600305789, 1095.5891540672249, 1135.9318440893574, 1154.5324143721807, 1162.4478372772865, 14625.414983400546, 14933.551993440215, 15128.697426051418, 15498.225088745517, 15534.300956456986, 318720.21919671225, 515854.0, 517317.0, 519549.0, 535770.0, 56764.43235567591, 57539.0, 57699.423005770244, 57704.71147644319, 57936.13095803566, 1460.4815290571908, 1485.6731519065788, 1500.3548474156, 1520.9467668631544, 1619.3603526606923, 29502.409951801274, 31655.120242076322, 32195.35609287848, 32423.189420263738, 32997.83501082479, 51870.22194667008, 52510.0, 52573.0, 52656.736716316176, 52840.73579632077, 299054.0, 305412.0, 305475.0, 306546.0, 306974.0, 35026.12434689051, 35026.82486587551, 35279.94160175199, 35472.29055418826, 35539.0, 47571.28643070426, 47714.0, 48244.27633585429, 48641.270380945025, 49291.26063109128, 39458.0, 40065.799671001456, 40126.39810402788, 40156.0, 40191.0, 38897.24962376643, 39057.609423906535, 39698.80150599228, 40340.193196135326, 40862.182756345304, 38886.222275554894, 39238.215235695694, 40203.0, 40246.1950760989, 40469.0, 35337.293254135286, 35725.0, 36211.63788362188, 36387.272254554235, 36527.817360913024, 27243.182704518895, 27324.453510930067, 27567.862160689067, 27723.861380692968, 27781.861090694416], "unit": "score", "name": "ext.html", "value": 20611.43452823931}, {"lowerIsBetter": false, "replicates": [355.3798621405647, 376.80217885610045, 391.7394932369974, 393.98030098495104, 400.2095860675167, 17930.46208613742, 18594.442166735003, 18951.241950322004, 19452.902735486303, 19454.027298635065, 11652.708682282948, 18278.086095695195, 18522.814771852278, 18743.531411714714, 18768.0, 5064.442911279765, 5219.686818790866, 5243.030039442715, 5256.080185967459, 5256.185291279839, 5296.602754793386, 5509.0, 5521.668699878, 5537.916931246034, 5561.332640083196, 5454.154606036051, 5504.559635229172, 5523.0, 5856.297244330686, 5859.560532960024, 5784.421557844224, 5789.594728369016, 5795.942040579583, 5806.680632565207, 5846.473817356437, 5018.673786203885, 5228.163493840967, 5254.816081437131, 5517.503424691797, 5534.142207957773, 13138.934305328508, 13344.132631378929, 13449.798253026212, 13616.591502254949, 13636.522721704692, 2253.188852013274, 2318.5131122464304, 2395.149721848736, 2430.902763889442, 2968.495355789521, 9603.231741460666, 9657.275704322134, 9793.167580755644, 9888.20894328452, 10017.599296028151, 1822.070743920597, 1871.8596105292158, 1885.575745457275, 1948.6979518174705, 1997.5505511259996, 64346.356536434505, 65069.0, 65925.06905733, 66787.3321266786, 67675.0, 9944.303898727165, 10279.486025698834, 10455.111315538112, 10466.11038061758, 10501.21240906935, 14316.928415358065, 14611.196384198971, 14634.853651463562, 14657.853421465863, 14669.266536673123, 8126.512409255463, 8358.623861926106, 8453.830923381498, 8478.152184781473, 8516.06323304436, 8461.23848853606, 8488.278496327757, 8500.914990850137, 8537.146285371537, 8573.142685731502, 4361.672874534359, 4455.1535208310315, 4511.075229577928, 4524.9547504524535, 4597.42532183477, 1885.283592234942, 1899.8290153886217, 1926.5376309685576, 1933.7776155741988, 1941.3787587971997, 942.2838642631649, 986.1223511075149, 1012.4886932099242, 1025.190099821133, 1072.6781965410346, 17486.562835928948, 18046.0, 18610.160044589786, 18659.600529960037, 18820.717689234672, 1013.816615826306, 1042.1975079188983, 1042.4370839746603, 1056.9788604227872, 1107.1474964277622, 9500.47747373901, 9643.517824108907, 9783.315167938319, 9792.363496372855, 9865.950670246602, 508854.0, 509856.0, 511789.0, 521956.0, 527110.0, 74836.0, 76909.6154519235, 78269.0, 78758.60620696975, 82918.0, 1051.7055224537141, 1075.0969185883896, 1082.9566817327534, 1085.8099832529276, 1089.0416433538435, 16615.3353865844, 16691.49925502237, 16701.66596668084, 16801.831981680516, 17092.829071709122, 35701.64298356983, 36089.45865811963, 37030.0, 37046.814765927076, 37117.25765484729, 48866.5113348862, 53671.0, 53701.19448208202, 53849.461505384446, 53921.730391347795, 8179.182081791773, 8340.874886876823, 8364.289035432057, 8388.664453421794, 8586.270167035871, 9317.021712720067, 12551.246925184518, 13076.607701768962, 13297.002724795873, 13555.390007449885, 11255.437228138724, 11270.887291126985, 11583.247088939192, 11732.354720490113, 11787.587434439753, 11418.543258269909, 11529.596464123715, 11591.188616796744, 11670.766584668088, 12041.33772642513, 12028.338441385458, 12073.517059317528, 12084.154109212272, 12143.271403715806, 12208.633740987785, 8393.496390216607, 8489.40574159803, 8507.447015943944, 8551.401401901807, 8630.050694423733, 11687.76624467523, 11899.821502677294, 11919.0, 11975.461104250155, 12021.0], "unit": "score", "name": "jquery.html", "value": 8815.59410970364}, {"lowerIsBetter": false, "replicates": [1650.744134659128, 1669.1403926977605, 1934.322986954566, 2009.136071489259, 2011.175418078588, 8766.956165219164, 8857.822843543125, 8938.687145949893, 9077.36458447909, 9081.318901082412, 8969.955150224256, 9064.909350906506, 9082.273418126551, 9092.636294548227, 9149.176574108329, 2430.805535557151, 2453.1414005098163, 2454.1778504201116, 2466.3834041489627, 2467.4078221226955, 2467.087177744237, 2525.873706314677, 2541.7204107548155, 2544.9745502545015, 2552.412945022646, 2443.7189723181796, 2457.1031573475643, 2496.613024981131, 2499.5375855466705, 2506.9247922562354, 2473.023155853437, 2486.254123762864, 2495.987520062397, 2505.386180385817, 2509.4855554611263, 2507.2979565721444, 2513.5349960257413, 2532.3669082729316, 2538.5430622487943, 2549.54108260513, 8991.460512369278, 9027.954860225722, 9032.27741780656, 9056.184943355129, 9104.499252541107, 5394.973025134888, 5533.557315414757, 5537.473939975695, 5544.306961629796, 5550.611457197998, 3368.309496553201, 3414.5219669246326, 3433.896983090486, 3444.207832198583, 3468.3756923753713, 972.1445128287132, 1026.1790567546009, 1036.922230832683, 1037.6575730009079, 1055.472263868066, 12587.118901676886, 12594.181378210387, 12651.620451386381, 12662.0, 12694.80957785634, 4570.765893208882, 4714.599259062949, 4750.762461876892, 4752.429708434941, 4766.094442055998, 10169.084782369622, 10190.541425635864, 10202.897971020344, 10233.641822536325, 10256.435896025641, 5444.673319600836, 5455.0453670607485, 5464.18037294409, 5464.371597266365, 5486.478784515464, 4810.254410566367, 5008.924866127011, 5015.0, 5048.823291184791, 5049.84850454487, 3787.886363409102, 3849.9807500962315, 3865.724310977371, 3868.2843673920415, 3924.60753924611, 1050.5902697947806, 1053.6154303679255, 1105.5135740274254, 1136.794997302845, 1162.8778978207336, 1467.9119252844864, 1491.9627009324636, 1506.1113942773816, 1508.0273223770607, 1532.3181184372847, 8684.739457816275, 8695.521746303888, 8709.782255443537, 8722.86915696265, 8754.168354006359, 532.0609124894564, 532.9786808527615, 547.6248769592762, 548.101114172757, 556.1435389500206, 6108.694565271719, 6117.296510901303, 6123.693815309217, 6124.877502449926, 6178.41305076017, 11040.723981900517, 11214.719632009102, 11267.492962816694, 11347.943260283811, 11349.659510214708, 10819.0, 10999.120070394349, 11022.0, 11123.332600044023, 11226.831597526043, 8567.700130495527, 8651.091635378194, 8694.391392602583, 8719.171678690514, 8737.868931965899, 7741.07107147146, 7798.493097948615, 7798.6490607923915, 7823.100343460347, 7837.647305871135, 9776.706698799047, 9795.853062204214, 9814.85277720849, 9867.901320986699, 9987.800243995225, 9950.701478955643, 10012.749681258027, 10085.53759704824, 10114.089731924161, 10137.797244055226, 7423.591702456417, 7514.248575142442, 7581.886271706039, 7755.2632499912415, 7780.610969451618, 8409.327253819558, 8418.579071046546, 8430.536320502431, 8454.492730436194, 8486.066532681276, 7750.612469376621, 7945.404094693036, 7969.163237859942, 8058.19418058213, 8106.148854370206, 7784.9610751945875, 7786.532808031537, 7790.298873101448, 7890.881636775568, 7984.84030319402, 7653.464257501922, 8125.349972002344, 8193.057798353027, 8204.712835050745, 8229.053658829072, 7308.707651693872, 7344.045274114545, 7344.816379590553, 7365.926340736738, 7367.2264412235945, 7144.249853765487, 7330.157031941182, 7406.4074874008875, 7433.219511951167, 7448.553086814808], "unit": "score", "name": "mootools.html", "value": 4967.171908744551}, {"lowerIsBetter": false, "replicates": [342.74123037106983, 342.963988781178, 351.06091206023893, 353.2722591461588, 357.24086316577274, 6318.968405157973, 6320.4943604511645, 6429.389208025242, 6464.547481676284, 6485.383888530594, 6341.619502829833, 6358.237011558619, 6361.968190159054, 6381.872362552746, 6403.263624683163, 4720.763961801913, 4826.7827947742435, 4828.73441960692, 4840.128776820171, 4889.6821706589135, 4872.537108974641, 4892.3639926809465, 4901.705897646153, 4902.142125128088, 4903.019396120772, 4846.321514987904, 4852.053849499349, 4852.757362131897, 4853.490383509716, 4856.39295088114, 4843.612510999129, 4857.319975203474, 4858.222684370501, 4865.270209468573, 4869.732164730938, 4229.746215227096, 4232.78836058199, 4233.534311225762, 4238.449001629769, 4242.172776308621, 5932.762689492415, 5956.761729530814, 6060.939390606081, 6064.3935606439445, 6070.423309785563, 5580.135079062752, 5580.246666700024, 5582.190582365534, 5592.748326325284, 5615.185798059259, 6697.4261048653525, 6730.0577919091365, 6737.124173857416, 6757.256701762803, 6765.898511522331, 4628.236341003731, 4631.583157515806, 4632.768361581908, 4641.791119399635, 4650.534946505356, 7012.544184627983, 7014.544054636483, 7056.647167641598, 7078.858422831515, 7092.397146242575, 4592.678512504092, 4755.904881902343, 4756.072565849695, 4758.286257061399, 4776.450708168536, 4860.3195552622665, 4877.829275975395, 4889.877753056202, 4892.951070489249, 4909.189983652729, 5632.9436705632415, 5653.830385088454, 5655.858603534863, 5656.321241451053, 5657.20799088128, 6848.246692863781, 6856.417204537571, 6861.0, 6916.20463646687, 6959.095317608679, 1690.2647348403484, 1745.8079611242754, 1747.3098126240318, 1748.2307784574746, 1751.1331890713923, 1109.9889001110048, 1115.983260251097, 1149.8447709559102, 1154.5554961339944, 1160.6692092753524, 6544.443722283564, 6553.377429144223, 6555.4427873631275, 6557.475401967831, 6563.245226798979, 7042.295770423019, 7059.2234854166, 7061.682224299919, 7065.752698655522, 7067.505274630829, 6360.809175724736, 6618.30507796684, 6631.502637302222, 6635.701393437211, 6636.270010298863, 3817.9427308590393, 3847.9807600961817, 3854.5567259764925, 3855.4024126260474, 3857.61423857612, 7300.269973002657, 7396.96301518489, 7405.1854296027395, 7408.111026676834, 7426.665800039012, 7297.124345078519, 7303.8539229216185, 7308.378787803096, 7315.890261646079, 7358.337749602454, 7093.680784364716, 7431.405487560982, 7438.181800001996, 7463.514871533333, 7466.178720340867, 7113.0753002109395, 7119.359257666835, 7134.857302854018, 7147.1780745214965, 7153.070100887059, 7025.402840758388, 7044.682989265598, 7050.788476345718, 7057.894131588133, 7067.540609860343, 7254.310840470358, 7410.444216683878, 7422.331990120915, 7425.925740742523, 7429.4799364044, 4723.102610503994, 4793.664443489062, 4799.424069111729, 4800.279958006187, 4804.303376010389, 7097.0, 7101.893471598033, 7134.857302854018, 7162.46281528877, 7165.928340716526, 6900.102986611709, 6927.515073944775, 6933.653317334214, 6939.167299924042, 6961.443084553325, 6783.491238157257, 6925.168979722465, 6925.930740692528, 6939.30606939302, 6940.444764418935, 6800.795976120724, 6802.82992925161, 6813.557118787263, 6832.282610325844, 6834.214065382345, 6925.342092501204, 6963.199232088375, 6967.965160174167, 6970.825729356604, 6971.128608923885, 6737.764178253738, 6738.696758645775, 6777.220619628806, 6789.93210067893, 6790.388865002174], "unit": "score", "name": "prototype.html", "value": 5143.612145399282}, {"lowerIsBetter": false, "replicates": [893.1961234888599, 903.5437104262346, 911.7492689510384, 928.6981730937445, 930.5812384427, 14540.27298635068, 14749.115053096808, 14750.483733069332, 17044.82955170448, 17420.30318787247, 16029.839701602981, 16240.350385984577, 16280.104594247312, 16291.429799957004, 16304.0, 916.57379318617, 940.0693313619502, 940.0975063938627, 949.4398305000049, 966.2897770138942, 967.2165545907802, 969.0938972061145, 969.8448248280276, 971.0435221307007, 972.8978457261992, 999.1257649556638, 999.3304485994365, 1001.0540039662521, 1003.2676146413123, 1005.3917379985077, 989.7970915962246, 990.8612794208744, 992.0823238504355, 992.8758905136858, 993.2203220471931, 714.4427346669606, 733.6441825714525, 734.1337222077946, 734.4528326396816, 734.9669264883094, 13797.24115173665, 13858.722825543533, 13863.861361386458, 13866.306684665726, 13934.372953217027, 13249.536266230733, 13396.397162127727, 13403.86596134036, 13480.730385392335, 13743.381547830271, 11456.4844581994, 11515.596954106566, 11517.827232591433, 11660.533578656843, 11846.052315814713, 3874.4769456123345, 3940.6650434713083, 3947.3092208863336, 3976.6421022108148, 4066.34938409853, 45237.32144017842, 45927.0, 45958.0, 47829.521704782856, 48541.75729121367, 10890.237683362247, 11018.11855051594, 11235.382053986945, 11250.268732532359, 11376.374299413446, 19516.12177452018, 19522.316718915055, 19779.307724229584, 19953.301634442723, 20098.79901200969, 8401.201885820838, 8452.28155606768, 8553.957230213933, 8575.313974881994, 8634.956825215959, 4761.928571071437, 4845.563899249085, 4869.610431165498, 5006.4492905780335, 5051.974740126276, 3411.4541673332146, 3455.87904423349, 3456.55064841569, 3462.770716395694, 3474.42671959129, 644.7614382678439, 668.4284936379423, 671.1610486891386, 672.4620303756975, 675.0751470485467, 621.6114928169894, 699.7935608995358, 719.9208087110413, 726.1866709285634, 728.2644529025616, 8902.910970890338, 9056.864147037799, 9424.858627120599, 9518.619255229713, 9618.759531011641, 605.4067014325985, 709.4678990756933, 728.4864170759602, 739.9741009064657, 742.3949481172826, 4248.4052232687445, 4286.39990401344, 4313.525512193656, 4356.6732495063, 4403.471583410012, 56784.43215567874, 57851.132233016535, 57954.42045579575, 58132.12801807892, 58201.0, 50180.498195018314, 51751.48248517467, 51800.0, 51869.48130518722, 54470.182947255824, 46444.0, 46993.0, 46995.885185166066, 47022.29466558004, 48020.27969580459, 9227.538623068685, 9341.486218258062, 9371.344005919793, 9588.424694518351, 9896.10935015852, 34557.82721086378, 34775.0, 35220.823895880356, 35792.46311305281, 35963.46054809232, 40789.38815917823, 43504.34743478787, 43530.0, 43567.34648980205, 44130.55869441393, 12397.93801030989, 12573.057020723665, 12631.494740210655, 12717.491300347883, 12838.422270998015, 12116.939415302868, 12224.938875305923, 12241.510339586317, 12305.0, 12808.615741527768, 12159.148859579744, 12241.938790305992, 12308.26150430977, 12808.615741527768, 12901.290429026494, 12168.57409990646, 12201.938990304992, 12387.07096967749, 12744.61766147017, 12793.36033198355, 12478.18891772032, 12536.874631253571, 12606.810897836724, 12609.621711348675, 12840.0, 10328.638497652546, 10807.513661885077, 11093.611723589636, 11251.606193783178, 11739.88260117422, 10198.796024079329, 10976.945115274373, 11049.502772375423, 11067.446627668745, 11292.153088518558], "unit": "score", "name": "yui.html", "value": 6942.691648883114}], "name": "dromaeo_css", "value": 7516.364885278353}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 104.0, 111.0, 112.0, 111.0, 122.0, 110.0, 111.0, 112.0, 112.0], "unit": "score", "name": "ai-astar", "value": 111.7}, {"lowerIsBetter": true, "replicates": [156.0, 129.0, 156.0, 172.0, 130.0, 160.0, 157.0, 131.0, 177.0, 129.0], "unit": "score", "name": "audio-beat-detection", "value": 149.7}, {"lowerIsBetter": true, "replicates": [163.0, 162.0, 163.0, 163.0, 163.0, 161.0, 161.0, 162.0, 166.0, 162.0], "unit": "score", "name": "audio-dft", "value": 162.6}, {"lowerIsBetter": true, "replicates": [77.0, 77.0, 75.0, 160.0, 77.0, 75.0, 73.0, 77.0, 166.0, 77.0], "unit": "score", "name": "audio-fft", "value": 93.4}, {"lowerIsBetter": true, "replicates": [93.0, 93.0, 144.0, 93.0, 95.0, 92.0, 148.0, 92.0, 94.0, 143.0], "unit": "score", "name": "audio-oscillator", "value": 108.7}, {"lowerIsBetter": true, "replicates": [117.0, 118.0, 118.0, 117.0, 117.0, 118.0, 117.0, 118.0, 119.0, 119.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.8}, {"lowerIsBetter": true, "replicates": [149.0, 146.0, 147.0, 147.0, 147.0, 147.0, 147.0, 146.0, 148.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 147.1}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 96.0, 97.0, 97.0, 96.0, 96.0, 96.0, 96.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 96.1}, {"lowerIsBetter": true, "replicates": [60.0, 58.0, 58.0, 58.0, 58.0, 60.0, 58.0, 70.0, 56.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 59.1}, {"lowerIsBetter": true, "replicates": [72.0, 76.0, 77.0, 75.0, 72.0, 73.0, 72.0, 72.0, 72.0, 72.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 73.3}, {"lowerIsBetter": true, "replicates": [79.0, 79.0, 78.0, 86.0, 79.0, 80.0, 86.0, 78.0, 80.0, 80.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.5}, {"lowerIsBetter": true, "replicates": [117.0, 114.0, 117.0, 125.0, 117.0, 120.0, 118.0, 125.0, 115.0, 119.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 118.7}, {"lowerIsBetter": true, "replicates": [138.0, 149.0, 148.0, 139.0, 151.0, 138.0, 146.0, 147.0, 148.0, 136.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 144.0}, {"lowerIsBetter": true, "replicates": [67.0, 68.0, 67.0, 70.0, 71.0, 78.0, 71.0, 67.0, 71.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 69.6}], "name": "kraken", "value": 1532.3}]} 13:54:09 INFO - Return code: 0 13:54:09 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 13:54:09 ERROR - # TBPL SUCCESS # 13:54:09 INFO - Running post-action listener: _resource_record_post_action 13:54:09 INFO - Running post-run listener: _resource_record_post_run 13:54:10 INFO - Total resource usage - Wall time: 1184s; CPU: 13.0%; Read bytes: 12288; Write bytes: 337944576; Read time: 28; Write time: 328340 13:54:10 INFO - install - Wall time: 13s; CPU: 14.0%; Read bytes: 0; Write bytes: 119615488; Read time: 0; Write time: 156912 13:54:10 INFO - run-tests - Wall time: 1171s; CPU: 13.0%; Read bytes: 12288; Write bytes: 218329088; Read time: 28; Write time: 171428 13:54:10 INFO - Running post-run listener: _upload_blobber_files 13:54:10 INFO - Blob upload gear active. 13:54:10 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:54:10 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 13:54:10 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'] 13:54:10 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 13:54:11 INFO - (blobuploader) - INFO - Open directory for files ... 13:54:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 13:54:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:54:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:54:12 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 13:54:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:54:12 INFO - (blobuploader) - INFO - Done attempting. 13:54:12 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 13:54:12 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:54:12 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:54:12 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 13:54:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:54:12 INFO - (blobuploader) - INFO - Done attempting. 13:54:12 INFO - (blobuploader) - INFO - Iteration through files over. 13:54:12 INFO - Return code: 0 13:54:12 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:54:12 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:54:12 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/bb3d61a644df4baa8ae9f2473a35e914501f12ccf03dff2e960f6ca58b32793a72ae539d6dc0a7822915293bc11a546988409820d3142256296fe513b2a71292", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/b0b73bcdac0bcfaed6efd205f27ba22566cb7a3fc79e881660b00786172aa64f40a14af4620f3c3183ea550d1f86b2b92252cae47f54a1b677407d9eeb2a3663"} 13:54:12 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:54:12 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:54:12 INFO - Contents: 13:54:12 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/bb3d61a644df4baa8ae9f2473a35e914501f12ccf03dff2e960f6ca58b32793a72ae539d6dc0a7822915293bc11a546988409820d3142256296fe513b2a71292", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/b0b73bcdac0bcfaed6efd205f27ba22566cb7a3fc79e881660b00786172aa64f40a14af4620f3c3183ea550d1f86b2b92252cae47f54a1b677407d9eeb2a3663"} 13:54:12 INFO - Running post-run listener: copy_logs_to_upload_dir 13:54:12 INFO - Copying logs to upload dir... 13:54:12 INFO - mkdir: /builds/slave/test/build/upload/logs 13:54:12 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1515.464560 ========= master_lag: 0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 25 mins, 15 secs) (at 2016-04-26 13:54:11.438833) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-26 13:54:11.442613) ========= 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=523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507 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/bb3d61a644df4baa8ae9f2473a35e914501f12ccf03dff2e960f6ca58b32793a72ae539d6dc0a7822915293bc11a546988409820d3142256296fe513b2a71292", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/b0b73bcdac0bcfaed6efd205f27ba22566cb7a3fc79e881660b00786172aa64f40a14af4620f3c3183ea550d1f86b2b92252cae47f54a1b677407d9eeb2a3663"} build_url:https://queue.taskcluster.net/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011373 build_url: 'https://queue.taskcluster.net/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/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/bb3d61a644df4baa8ae9f2473a35e914501f12ccf03dff2e960f6ca58b32793a72ae539d6dc0a7822915293bc11a546988409820d3142256296fe513b2a71292", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/b0b73bcdac0bcfaed6efd205f27ba22566cb7a3fc79e881660b00786172aa64f40a14af4620f3c3183ea550d1f86b2b92252cae47f54a1b677407d9eeb2a3663"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-26 13:54:11.471395) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:54:11.471744) ========= 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=523ca41ca1e0623de333ad52000001bf-1461702536.52426-1118565507 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004485 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:54:11.556759) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-26 13:54:11.557089) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-26 13:54:11.557374) ========= ========= Total master_lag: 0.16 =========