builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-040 starttime: 1461702583.65 results: success (0) buildid: 20160425205003 builduid: 68a02e46d6d349f3b74437b25b685305 revision: 5bbf2e7c2fc6ff9010b1948e2f11477f48ee36e2 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:43.650735) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:43.651258) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:43.651536) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:43.667646) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:43.667947) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-26 13:29:43-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 223M=0s 2016-04-26 13:29:43 (223 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.107686 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:43.790825) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:43.791139) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018376 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:43.841543) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:43.841911) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-26 13:29:44,081 truncating revision to first 12 chars 2016-04-26 13:29:44,081 Setting DEBUG logging. 2016-04-26 13:29:44,081 attempt 1/10 2016-04-26 13:29:44,081 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:29:44,411 unpacking tar archive at: mozilla-beta-5bbf2e7c2fc6/testing/mozharness/ program finished with exit code 0 elapsedTime=0.646159 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:44.501964) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:44.502303) ========= script_repo_revision: 5bbf2e7c2fc6ff9010b1948e2f11477f48ee36e2 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:44.502695) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:44.502963) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-26 13:29:44.513103) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 28 mins, 7 secs) (at 2016-04-26 13:29:44.513461) ========= /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=9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 13:29:44 INFO - MultiFileLogger online at 20160426 13:29:44 in /builds/slave/test 13:29:44 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:29:44 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 13:29:44 INFO - {'append_to_log': False, 13:29:44 INFO - 'base_work_dir': '/builds/slave/test', 13:29:44 INFO - 'blob_upload_branch': 'Mozilla-Beta', 13:29:44 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 13:29:44 INFO - 'branch': 'Mozilla-Beta', 13:29:44 INFO - 'buildbot_json_path': 'buildprops.json', 13:29:44 INFO - 'config_files': ('talos/linux_config.py',), 13:29:44 INFO - 'default_actions': ('clobber', 13:29:44 INFO - 'read-buildbot-config', 13:29:44 INFO - 'download-and-extract', 13:29:44 INFO - 'populate-webroot', 13:29:44 INFO - 'create-virtualenv', 13:29:44 INFO - 'install', 13:29:44 INFO - 'run-tests'), 13:29:44 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 13:29:44 INFO - 'download_minidump_stackwalk': True, 13:29:44 INFO - 'download_symbols': 'ondemand', 13:29:44 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 13:29:44 INFO - 'tooltool.py': '/tools/tooltool.py', 13:29:44 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 13:29:44 INFO - '/tools/misc-python/virtualenv.py')}, 13:29:44 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 13:29:44 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 13:29:44 INFO - 'installer_path': 'installer.exe', 13:29:44 INFO - 'log_level': 'info', 13:29:44 INFO - 'log_name': 'talos', 13:29:44 INFO - 'log_to_console': True, 13:29:44 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 13:29:44 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 13:29:44 INFO - 'opt_config_files': (), 13:29:44 INFO - 'pip_index': False, 13:29:44 INFO - 'sps_profile': False, 13:29:44 INFO - 'sps_profile_interval': 0, 13:29:44 INFO - 'suite': 'dromaeojs-e10s', 13:29:44 INFO - 'system_bits': '32', 13:29:44 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 13:29:44 INFO - 'title': 'talos-linux64-ix-040', 13:29:44 INFO - 'tooltool_cache': '/builds/tooltool_cache', 13:29:44 INFO - 'use_talos_json': True, 13:29:44 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 13:29:44 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 13:29:44 INFO - 'work_dir': 'build'} 13:29:44 INFO - ##### 13:29:44 INFO - ##### Running clobber step. 13:29:44 INFO - ##### 13:29:44 INFO - Running pre-action listener: _resource_record_pre_action 13:29:44 INFO - Running main action method: clobber 13:29:44 INFO - rmtree: /builds/slave/test/build 13:29:44 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 13:29:45 INFO - Running post-action listener: _resource_record_post_action 13:29:45 INFO - ##### 13:29:45 INFO - ##### Running read-buildbot-config step. 13:29:45 INFO - ##### 13:29:45 INFO - Running pre-action listener: _resource_record_pre_action 13:29:45 INFO - Running main action method: read_buildbot_config 13:29:45 INFO - Using buildbot properties: 13:29:45 INFO - { 13:29:45 INFO - "project": "", 13:29:45 INFO - "product": "firefox", 13:29:45 INFO - "script_repo_revision": "production", 13:29:45 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s", 13:29:45 INFO - "repository": "", 13:29:45 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs-e10s", 13:29:45 INFO - "buildid": "20160425205003", 13:29:45 INFO - "pgo_build": "True", 13:29:45 INFO - "basedir": "/builds/slave/test", 13:29:45 INFO - "buildnumber": 75, 13:29:45 INFO - "slavename": "talos-linux64-ix-040", 13:29:45 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 13:29:45 INFO - "platform": "ubuntu64_hw", 13:29:45 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 13:29:45 INFO - "branch": "mozilla-beta", 13:29:45 INFO - "repo_path": "releases/mozilla-beta", 13:29:45 INFO - "revision": "5bbf2e7c2fc6ff9010b1948e2f11477f48ee36e2", 13:29:45 INFO - "stage_platform": "linux64-pgo", 13:29:45 INFO - "builduid": "68a02e46d6d349f3b74437b25b685305", 13:29:45 INFO - "slavebuilddir": "test" 13:29:45 INFO - } 13:29:45 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:29:45 INFO - Running post-action listener: _resource_record_post_action 13:29:45 INFO - ##### 13:29:45 INFO - ##### Running download-and-extract step. 13:29:45 INFO - ##### 13:29:45 INFO - Running pre-action listener: _resource_record_pre_action 13:29:45 INFO - Running main action method: download_and_extract 13:29:45 INFO - mkdir: /builds/slave/test/build/tests 13:29:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:29:45 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:29:45 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:29:45 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:29:45 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:29:45 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:46 INFO - Downloaded 1412 bytes. 13:29:46 INFO - Reading from file /builds/slave/test/build/firefox-47.0.en-US.linux-x86_64.test_packages.json 13:29:46 INFO - Using the following test package requirements: 13:29:46 INFO - {u'common': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 13:29:46 INFO - u'cppunittest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:46 INFO - u'firefox-47.0.en-US.linux-x86_64.cppunittest.tests.zip'], 13:29:46 INFO - u'gtest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:46 INFO - u'firefox-47.0.en-US.linux-x86_64.gtest.tests.zip'], 13:29:46 INFO - u'jittest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:46 INFO - u'jsshell-linux-x86_64.zip'], 13:29:46 INFO - u'mochitest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:46 INFO - u'firefox-47.0.en-US.linux-x86_64.mochitest.tests.zip'], 13:29:46 INFO - u'mozbase': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 13:29:46 INFO - u'reftest': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:46 INFO - u'firefox-47.0.en-US.linux-x86_64.reftest.tests.zip'], 13:29:46 INFO - u'talos': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:46 INFO - u'firefox-47.0.en-US.linux-x86_64.talos.tests.zip'], 13:29:46 INFO - u'web-platform': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:46 INFO - u'firefox-47.0.en-US.linux-x86_64.web-platform.tests.zip'], 13:29:46 INFO - u'webapprt': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'], 13:29:46 INFO - u'xpcshell': [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip', 13:29:46 INFO - u'firefox-47.0.en-US.linux-x86_64.xpcshell.tests.zip']} 13:29:46 INFO - Downloading packages: [u'firefox-47.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 13:29:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:29:46 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:46 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:46 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:46 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:46 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:36:26 INFO - Downloaded 23363259 bytes. 13:36:26 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:36:26 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:36:27 INFO - Return code: 0 13:36:27 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:36:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:36:27 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:36:27 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:36:27 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:36:27 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:36:27 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:36:31 INFO - Downloaded 23363259 bytes. 13:36:31 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:36:31 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:36:32 INFO - Return code: 0 13:36:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:36:32 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:36:32 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:36:32 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:36:32 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:36:32 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:36:51 INFO - Downloaded 10845194 bytes. 13:36:51 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:36:51 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:36:51 INFO - Return code: 0 13:36:51 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:36:51 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:36:51 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:36:51 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:36:51 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:36:51 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:37:39 INFO - Downloaded 53786059 bytes. 13:37:39 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:37:39 INFO - mkdir: /builds/slave/test/properties 13:37:39 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 13:37:39 INFO - Writing to file /builds/slave/test/properties/build_url 13:37:39 INFO - Contents: 13:37:39 INFO - build_url:https://queue.taskcluster.net/v1/task/f2H4qtKsTHSXcpzI1Lqw0g/artifacts/public/build/firefox-47.0.en-US.linux-x86_64.tar.bz2 13:37:40 INFO - Running post-action listener: _resource_record_post_action 13:37:40 INFO - Running post-action listener: set_extra_try_arguments 13:37:40 INFO - ##### 13:37:40 INFO - ##### Running populate-webroot step. 13:37:40 INFO - ##### 13:37:40 INFO - Running pre-action listener: _resource_record_pre_action 13:37:40 INFO - Running main action method: populate_webroot 13:37:40 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 13:37:40 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 13:37:40 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 13:37:40 INFO - '--tppagecycles', 13:37:40 INFO - '7'], 13:37:40 INFO - 'tests': ['tsvgm']}}, 13:37:40 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 13:37:40 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 13:37:40 INFO - 'tests': ['tresize', 'tcanvasmark']}, 13:37:40 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 13:37:40 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 13:37:40 INFO - 'tests': ['dromaeo_css', 'kraken']}, 13:37:40 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:37:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:37:40 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:37:40 INFO - 'talos_options': ['--e10s'], 13:37:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:37:40 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:37:40 INFO - 'tests': ['damp', 'tps']}, 13:37:40 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:37:40 INFO - 'talos_options': ['--e10s'], 13:37:40 INFO - 'tests': ['damp', 'tps']}, 13:37:40 INFO - 'g3': {'tests': ['dromaeo_dom']}, 13:37:40 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 13:37:40 INFO - 'other': {'tests': ['a11yr', 13:37:40 INFO - 'ts_paint', 13:37:40 INFO - 'tpaint', 13:37:40 INFO - 'sessionrestore', 13:37:40 INFO - 'sessionrestore_no_auto_restore', 13:37:40 INFO - 'tabpaint']}, 13:37:40 INFO - 'other-e10s': {'talos_options': ['--e10s'], 13:37:40 INFO - 'tests': ['a11yr', 13:37:40 INFO - 'ts_paint', 13:37:40 INFO - 'tpaint', 13:37:40 INFO - 'sessionrestore', 13:37:40 INFO - 'sessionrestore_no_auto_restore', 13:37:40 INFO - 'tabpaint']}, 13:37:40 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 13:37:40 INFO - 'tests': ['a11yr', 13:37:40 INFO - 'ts_paint', 13:37:40 INFO - 'tpaint', 13:37:40 INFO - 'sessionrestore', 13:37:40 INFO - 'sessionrestore_no_auto_restore', 13:37:40 INFO - 'tabpaint']}, 13:37:40 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 13:37:40 INFO - 'tests': ['a11yr', 13:37:40 INFO - 'ts_paint', 13:37:40 INFO - 'tpaint', 13:37:40 INFO - 'sessionrestore', 13:37:40 INFO - 'sessionrestore_no_auto_restore', 13:37:40 INFO - 'tabpaint']}, 13:37:40 INFO - 'other_l64': {'tests': ['a11yr', 13:37:40 INFO - 'ts_paint', 13:37:40 INFO - 'tpaint', 13:37:40 INFO - 'sessionrestore', 13:37:40 INFO - 'sessionrestore_no_auto_restore', 13:37:40 INFO - 'tabpaint']}, 13:37:40 INFO - 'other_nol64': {'tests': ['a11yr', 13:37:40 INFO - 'ts_paint', 13:37:40 INFO - 'tpaint', 13:37:40 INFO - 'sessionrestore', 13:37:40 INFO - 'sessionrestore_no_auto_restore', 13:37:40 INFO - 'tabpaint']}, 13:37:40 INFO - 'svgr': {'tests': ['tsvgx', 13:37:40 INFO - 'tsvgr_opacity', 13:37:40 INFO - 'tart', 13:37:40 INFO - 'tscrollx', 13:37:40 INFO - 'cart']}, 13:37:40 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 13:37:40 INFO - 'tests': ['tsvgx', 13:37:40 INFO - 'tsvgr_opacity', 13:37:40 INFO - 'tart', 13:37:40 INFO - 'tscrollx', 13:37:40 INFO - 'cart']}, 13:37:40 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:37:40 INFO - 'tests': ['tp5o']}, 13:37:40 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:37:40 INFO - 'talos_options': ['--e10s'], 13:37:40 INFO - 'tests': ['tp5o']}, 13:37:40 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:37:40 INFO - 'talos_options': ['--xperf_path', 13:37:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:37:40 INFO - 'tests': ['tp5n']}, 13:37:40 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:37:40 INFO - 'talos_options': ['--e10s', 13:37:40 INFO - '--xperf_path', 13:37:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:37:40 INFO - 'tests': ['tp5n']}}, 13:37:40 INFO - 'talos.zip': {'path': '', 13:37:40 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 13:37:40 INFO - Running post-action listener: _resource_record_post_action 13:37:40 INFO - ##### 13:37:40 INFO - ##### Running create-virtualenv step. 13:37:40 INFO - ##### 13:37:40 INFO - Running pre-action listener: _resource_record_pre_action 13:37:40 INFO - Running main action method: create_virtualenv 13:37:40 INFO - Creating virtualenv /builds/slave/test/build/venv 13:37:40 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:37:40 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 13:37:40 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 13:37:40 INFO - Using real prefix '/usr' 13:37:40 INFO - New python executable in /builds/slave/test/build/venv/bin/python 13:37:41 INFO - Installing distribute.............................................................................................................................................................................................done. 13:37:43 INFO - Installing pip.................done. 13:37:43 INFO - Return code: 0 13:37:43 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 13:37:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:37:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:37:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:37:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:37:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:43 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 0x7f80e3f3af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16308a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fd410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x178c160>, '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 0x178d060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x178d4f0>, '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': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', '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:37:43 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:37:43 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:37:43 INFO - Using env: {'DISPLAY': ':0', 13:37:43 INFO - 'HOME': '/home/cltbld', 13:37:43 INFO - 'LANG': 'en_US.UTF-8', 13:37:43 INFO - 'LANGUAGE': 'en_US:en', 13:37:43 INFO - 'LOGNAME': 'cltbld', 13:37:43 INFO - 'MAIL': '/var/mail/cltbld', 13:37:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:37:43 INFO - 'MOZ_NO_REMOTE': '1', 13:37:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:37:43 INFO - 'NO_EM_RESTART': '1', 13:37:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:37:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:37:43 INFO - 'PWD': '/builds/slave/test', 13:37:43 INFO - 'SHELL': '/bin/bash', 13:37:43 INFO - 'SHLVL': '1', 13:37:43 INFO - 'TERM': 'linux', 13:37:43 INFO - 'TMOUT': '86400', 13:37:43 INFO - 'USER': 'cltbld', 13:37:43 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', 13:37:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:37:43 INFO - '_': '/tools/buildbot/bin/python'} 13:37:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:37:43 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:37:43 INFO - Cleaning up... 13:37:43 INFO - Return code: 0 13:37:43 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 13:37:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:37:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:37:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:37:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:37:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:43 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 0x7f80e3f3af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16308a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fd410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x178c160>, '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 0x178d060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x178d4f0>, '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': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', '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:37:43 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:37:43 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:37:43 INFO - Using env: {'DISPLAY': ':0', 13:37:43 INFO - 'HOME': '/home/cltbld', 13:37:43 INFO - 'LANG': 'en_US.UTF-8', 13:37:43 INFO - 'LANGUAGE': 'en_US:en', 13:37:43 INFO - 'LOGNAME': 'cltbld', 13:37:43 INFO - 'MAIL': '/var/mail/cltbld', 13:37:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:37:43 INFO - 'MOZ_NO_REMOTE': '1', 13:37:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:37:43 INFO - 'NO_EM_RESTART': '1', 13:37:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:37:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:37:43 INFO - 'PWD': '/builds/slave/test', 13:37:43 INFO - 'SHELL': '/bin/bash', 13:37:43 INFO - 'SHLVL': '1', 13:37:43 INFO - 'TERM': 'linux', 13:37:43 INFO - 'TMOUT': '86400', 13:37:43 INFO - 'USER': 'cltbld', 13:37:43 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', 13:37:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:37:43 INFO - '_': '/tools/buildbot/bin/python'} 13:37:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:37:43 INFO - Downloading/unpacking psutil>=0.7.1 13:37:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:37:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:37:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:37:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:37:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:37:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:37:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 13:37:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:37:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:37:45 INFO - Installing collected packages: psutil 13:37:45 INFO - Running setup.py install for psutil 13:37:45 INFO - building 'psutil._psutil_linux' extension 13:37:45 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:37:46 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:37:46 INFO - building 'psutil._psutil_posix' extension 13:37:46 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:37:46 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:37:46 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:37:46 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:37:46 INFO - Successfully installed psutil 13:37:46 INFO - Cleaning up... 13:37:46 INFO - Return code: 0 13:37:46 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 13:37:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:37:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:37:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:37:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:37:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f80e3f3af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16308a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fd410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x178c160>, '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 0x178d060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x178d4f0>, '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': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', '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:37:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 13:37:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 13:37:46 INFO - Using env: {'DISPLAY': ':0', 13:37:46 INFO - 'HOME': '/home/cltbld', 13:37:46 INFO - 'LANG': 'en_US.UTF-8', 13:37:46 INFO - 'LANGUAGE': 'en_US:en', 13:37:46 INFO - 'LOGNAME': 'cltbld', 13:37:46 INFO - 'MAIL': '/var/mail/cltbld', 13:37:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:37:46 INFO - 'MOZ_NO_REMOTE': '1', 13:37:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:37:46 INFO - 'NO_EM_RESTART': '1', 13:37:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:37:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:37:46 INFO - 'PWD': '/builds/slave/test', 13:37:46 INFO - 'SHELL': '/bin/bash', 13:37:46 INFO - 'SHLVL': '1', 13:37:46 INFO - 'TERM': 'linux', 13:37:46 INFO - 'TMOUT': '86400', 13:37:46 INFO - 'USER': 'cltbld', 13:37:46 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', 13:37:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:37:46 INFO - '_': '/tools/buildbot/bin/python'} 13:37:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:37:46 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 13:37:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:37:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:37:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:37:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:37:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:37:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:37:48 INFO - Downloading mozsystemmonitor-0.0.tar.gz 13:37:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 13:37:48 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:37:48 INFO - Installing collected packages: mozsystemmonitor 13:37:48 INFO - Running setup.py install for mozsystemmonitor 13:37:48 INFO - Successfully installed mozsystemmonitor 13:37:48 INFO - Cleaning up... 13:37:48 INFO - Return code: 0 13:37:48 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 13:37:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:37:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:37:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:37:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:37:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:48 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 0x7f80e3f3af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16308a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fd410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x178c160>, '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 0x178d060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x178d4f0>, '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': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', '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:37:48 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:37:48 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:37:48 INFO - Using env: {'DISPLAY': ':0', 13:37:48 INFO - 'HOME': '/home/cltbld', 13:37:48 INFO - 'LANG': 'en_US.UTF-8', 13:37:48 INFO - 'LANGUAGE': 'en_US:en', 13:37:48 INFO - 'LOGNAME': 'cltbld', 13:37:48 INFO - 'MAIL': '/var/mail/cltbld', 13:37:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:37:48 INFO - 'MOZ_NO_REMOTE': '1', 13:37:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:37:48 INFO - 'NO_EM_RESTART': '1', 13:37:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:37:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:37:48 INFO - 'PWD': '/builds/slave/test', 13:37:48 INFO - 'SHELL': '/bin/bash', 13:37:48 INFO - 'SHLVL': '1', 13:37:48 INFO - 'TERM': 'linux', 13:37:48 INFO - 'TMOUT': '86400', 13:37:48 INFO - 'USER': 'cltbld', 13:37:48 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', 13:37:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:37:48 INFO - '_': '/tools/buildbot/bin/python'} 13:37:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:37:48 INFO - Downloading/unpacking blobuploader==1.2.4 13:37:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:37:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:37:48 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:37:48 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:37:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:37:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:37:50 INFO - Downloading blobuploader-1.2.4.tar.gz 13:37:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 13:37:50 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 13:37:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:37:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:37:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:37:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:37:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:37:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:37:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 13:37:51 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 13:37:51 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:37:51 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:37:51 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:37:51 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:37:51 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:37:51 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:37:51 INFO - Downloading docopt-0.6.1.tar.gz 13:37:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 13:37:51 INFO - Installing collected packages: blobuploader, requests, docopt 13:37:51 INFO - Running setup.py install for blobuploader 13:37:51 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 13:37:51 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 13:37:51 INFO - Running setup.py install for requests 13:37:51 INFO - Running setup.py install for docopt 13:37:51 INFO - Successfully installed blobuploader requests docopt 13:37:51 INFO - Cleaning up... 13:37:52 INFO - Return code: 0 13:37:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:37:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:37:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:37:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:37:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:37:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:52 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 0x7f80e3f3af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16308a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fd410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x178c160>, '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 0x178d060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x178d4f0>, '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': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', '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:37:52 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:37:52 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:37:52 INFO - Using env: {'DISPLAY': ':0', 13:37:52 INFO - 'HOME': '/home/cltbld', 13:37:52 INFO - 'LANG': 'en_US.UTF-8', 13:37:52 INFO - 'LANGUAGE': 'en_US:en', 13:37:52 INFO - 'LOGNAME': 'cltbld', 13:37:52 INFO - 'MAIL': '/var/mail/cltbld', 13:37:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:37:52 INFO - 'MOZ_NO_REMOTE': '1', 13:37:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:37:52 INFO - 'NO_EM_RESTART': '1', 13:37:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:37:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:37:52 INFO - 'PWD': '/builds/slave/test', 13:37:52 INFO - 'SHELL': '/bin/bash', 13:37:52 INFO - 'SHLVL': '1', 13:37:52 INFO - 'TERM': 'linux', 13:37:52 INFO - 'TMOUT': '86400', 13:37:52 INFO - 'USER': 'cltbld', 13:37:52 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', 13:37:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:37:52 INFO - '_': '/tools/buildbot/bin/python'} 13:37:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:37:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:37:52 INFO - Running setup.py (path:/tmp/pip-USdWCq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:37:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:37:52 INFO - Running setup.py (path:/tmp/pip-gljSpY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:37:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:37:52 INFO - Running setup.py (path:/tmp/pip-hJBqsT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:37:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:37:52 INFO - Running setup.py (path:/tmp/pip-HNAlo3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:37:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:37:52 INFO - Running setup.py (path:/tmp/pip-76EdEo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:37:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:37:52 INFO - Running setup.py (path:/tmp/pip-rR0E7S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:37:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:37:52 INFO - Running setup.py (path:/tmp/pip-D9Yl6W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:37:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:37:52 INFO - Running setup.py (path:/tmp/pip-ls5Nit-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:37:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:37:52 INFO - Running setup.py (path:/tmp/pip-yf4cul-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:37:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:37:52 INFO - Running setup.py (path:/tmp/pip-AK9zpK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:37:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:37:52 INFO - Running setup.py (path:/tmp/pip-CjRU7Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:37:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:37:53 INFO - Running setup.py (path:/tmp/pip-Q01ISb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:37:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:37:53 INFO - Running setup.py (path:/tmp/pip-kd1Edf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:37:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:37:53 INFO - Running setup.py (path:/tmp/pip-4v0RaA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:37:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:37:53 INFO - Running setup.py (path:/tmp/pip-OJchTZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:37:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:37:53 INFO - Running setup.py (path:/tmp/pip-hfQtPs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:37:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:37:53 INFO - Running setup.py (path:/tmp/pip-N7NdYz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:37:53 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 13:37:53 INFO - Running setup.py install for manifestparser 13:37:53 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 13:37:53 INFO - Running setup.py install for mozcrash 13:37:53 INFO - Running setup.py install for mozdebug 13:37:53 INFO - Running setup.py install for mozdevice 13:37:53 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 13:37:53 INFO - Installing dm script to /builds/slave/test/build/venv/bin 13:37:53 INFO - Running setup.py install for mozfile 13:37:53 INFO - Running setup.py install for mozhttpd 13:37:54 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 13:37:54 INFO - Running setup.py install for mozinfo 13:37:54 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 13:37:54 INFO - Running setup.py install for mozInstall 13:37:54 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 13:37:54 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 13:37:54 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 13:37:54 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 13:37:54 INFO - Running setup.py install for mozleak 13:37:54 INFO - Running setup.py install for mozlog 13:37:54 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 13:37:54 INFO - Running setup.py install for moznetwork 13:37:54 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 13:37:54 INFO - Running setup.py install for mozprocess 13:37:54 INFO - Running setup.py install for mozprofile 13:37:54 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 13:37:54 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 13:37:54 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 13:37:54 INFO - Running setup.py install for mozrunner 13:37:54 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 13:37:54 INFO - Running setup.py install for mozscreenshot 13:37:54 INFO - Running setup.py install for moztest 13:37:55 INFO - Running setup.py install for mozversion 13:37:55 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 13:37:55 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 13:37:55 INFO - Cleaning up... 13:37:55 INFO - Return code: 0 13:37:55 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:37:55 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:37:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:37:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:55 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:37:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:37:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:55 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 0x7f80e3f3af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16308a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fd410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x178c160>, '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 0x178d060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x178d4f0>, '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': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', '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:37:55 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:37:55 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:37:55 INFO - Using env: {'DISPLAY': ':0', 13:37:55 INFO - 'HOME': '/home/cltbld', 13:37:55 INFO - 'LANG': 'en_US.UTF-8', 13:37:55 INFO - 'LANGUAGE': 'en_US:en', 13:37:55 INFO - 'LOGNAME': 'cltbld', 13:37:55 INFO - 'MAIL': '/var/mail/cltbld', 13:37:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:37:55 INFO - 'MOZ_NO_REMOTE': '1', 13:37:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:37:55 INFO - 'NO_EM_RESTART': '1', 13:37:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:37:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:37:55 INFO - 'PWD': '/builds/slave/test', 13:37:55 INFO - 'SHELL': '/bin/bash', 13:37:55 INFO - 'SHLVL': '1', 13:37:55 INFO - 'TERM': 'linux', 13:37:55 INFO - 'TMOUT': '86400', 13:37:55 INFO - 'USER': 'cltbld', 13:37:55 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', 13:37:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:37:55 INFO - '_': '/tools/buildbot/bin/python'} 13:37:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:37:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:37:55 INFO - Running setup.py (path:/tmp/pip-hq1NIz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:37:55 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:37:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:37:55 INFO - Running setup.py (path:/tmp/pip-Eb1L4J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:37:55 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:37:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:37:55 INFO - Running setup.py (path:/tmp/pip-4mMQxJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:37:55 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:37:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:37:55 INFO - Running setup.py (path:/tmp/pip-krOEEg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:37:55 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:37:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:37:55 INFO - Running setup.py (path:/tmp/pip-HODcVo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:37:55 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:37:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:37:55 INFO - Running setup.py (path:/tmp/pip-9lAbJi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:37:55 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:37:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:37:55 INFO - Running setup.py (path:/tmp/pip-RcJb1A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:37:55 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:37:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:37:55 INFO - Running setup.py (path:/tmp/pip-j4MgAb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:37:55 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:37:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:37:55 INFO - Running setup.py (path:/tmp/pip-Tbiiyo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:37:56 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:37:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:37:56 INFO - Running setup.py (path:/tmp/pip-YAFV1t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:37:56 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:37:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:37:56 INFO - Running setup.py (path:/tmp/pip-W9yx5k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:37:56 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:37:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:37:56 INFO - Running setup.py (path:/tmp/pip-IIRqAw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:37:56 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:37:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:37:56 INFO - Running setup.py (path:/tmp/pip-HCmmSV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:37:56 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:37:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:37:56 INFO - Running setup.py (path:/tmp/pip-gvUF62-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:37:56 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:37:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:37:56 INFO - Running setup.py (path:/tmp/pip-c9hTYX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:37:56 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:37:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:37:56 INFO - Running setup.py (path:/tmp/pip-ejQ1jx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:37:56 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:37:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:37:56 INFO - Running setup.py (path:/tmp/pip-P4LqT7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:37:56 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:37:56 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:37:56 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:37:56 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:37:56 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:37:56 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:37:56 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:37:56 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:37:56 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:37:56 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:37:56 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:37:56 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:37:56 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:37:58 INFO - Downloading blessings-1.6.tar.gz 13:37:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 13:37:58 INFO - Installing collected packages: blessings 13:37:58 INFO - Running setup.py install for blessings 13:37:58 INFO - Successfully installed blessings 13:37:58 INFO - Cleaning up... 13:37:58 INFO - Return code: 0 13:37:58 INFO - Done creating virtualenv /builds/slave/test/build/venv. 13:37:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:37:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:37:58 INFO - Reading from file tmpfile_stdout 13:37:58 INFO - Current package versions: 13:37:58 INFO - argparse == 1.2.1 13:37:58 INFO - blessings == 1.6 13:37:58 INFO - blobuploader == 1.2.4 13:37:58 INFO - docopt == 0.6.1 13:37:58 INFO - manifestparser == 1.1 13:37:58 INFO - mozInstall == 1.12 13:37:58 INFO - mozcrash == 0.17 13:37:58 INFO - mozdebug == 0.1 13:37:58 INFO - mozdevice == 0.48 13:37:58 INFO - mozfile == 1.2 13:37:58 INFO - mozhttpd == 0.7 13:37:58 INFO - mozinfo == 0.9 13:37:58 INFO - mozleak == 0.1 13:37:58 INFO - mozlog == 3.1 13:37:58 INFO - moznetwork == 0.27 13:37:58 INFO - mozprocess == 0.22 13:37:58 INFO - mozprofile == 0.28 13:37:58 INFO - mozrunner == 6.11 13:37:58 INFO - mozscreenshot == 0.1 13:37:58 INFO - mozsystemmonitor == 0.0 13:37:58 INFO - moztest == 0.7 13:37:58 INFO - mozversion == 1.4 13:37:58 INFO - psutil == 3.1.1 13:37:58 INFO - requests == 1.2.3 13:37:58 INFO - wsgiref == 0.1.2 13:37:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:37: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:37:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:37:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37: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:37:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:37:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:58 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 0x7f80e3f3af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16308a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fd410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x178c160>, '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 0x178d060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x178d4f0>, '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': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', '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:37:58 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:37:58 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:37:58 INFO - Using env: {'DISPLAY': ':0', 13:37:58 INFO - 'HOME': '/home/cltbld', 13:37:58 INFO - 'LANG': 'en_US.UTF-8', 13:37:58 INFO - 'LANGUAGE': 'en_US:en', 13:37:58 INFO - 'LOGNAME': 'cltbld', 13:37:58 INFO - 'MAIL': '/var/mail/cltbld', 13:37:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:37:58 INFO - 'MOZ_NO_REMOTE': '1', 13:37:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:37:58 INFO - 'NO_EM_RESTART': '1', 13:37:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:37:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:37:58 INFO - 'PWD': '/builds/slave/test', 13:37:58 INFO - 'SHELL': '/bin/bash', 13:37:58 INFO - 'SHLVL': '1', 13:37:58 INFO - 'TERM': 'linux', 13:37:58 INFO - 'TMOUT': '86400', 13:37:58 INFO - 'USER': 'cltbld', 13:37:58 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', 13:37:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:37:58 INFO - '_': '/tools/buildbot/bin/python'} 13:37:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:37:59 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:37:59 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:37:59 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:37:59 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:37:59 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:37:59 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:37:59 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:37:59 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:37:59 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:37:59 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:37:59 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:37:59 INFO - Cleaning up... 13:37:59 INFO - Return code: 0 13:37:59 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 13:37:59 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:37:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:37:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:59 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:37:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:37:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:37:59 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 0x7f80e3f3af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16308a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fd410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x178c160>, '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 0x178d060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x178d4f0>, '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': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', '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:37:59 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:37:59 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:37:59 INFO - Using env: {'DISPLAY': ':0', 13:37:59 INFO - 'HOME': '/home/cltbld', 13:37:59 INFO - 'LANG': 'en_US.UTF-8', 13:37:59 INFO - 'LANGUAGE': 'en_US:en', 13:37:59 INFO - 'LOGNAME': 'cltbld', 13:37:59 INFO - 'MAIL': '/var/mail/cltbld', 13:37:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:37:59 INFO - 'MOZ_NO_REMOTE': '1', 13:37:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:37:59 INFO - 'NO_EM_RESTART': '1', 13:37:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:37:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:37:59 INFO - 'PWD': '/builds/slave/test', 13:37:59 INFO - 'SHELL': '/bin/bash', 13:37:59 INFO - 'SHLVL': '1', 13:37:59 INFO - 'TERM': 'linux', 13:37:59 INFO - 'TMOUT': '86400', 13:37:59 INFO - 'USER': 'cltbld', 13:37:59 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', 13:37:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:37:59 INFO - '_': '/tools/buildbot/bin/python'} 13:37:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:37:59 INFO - Downloading/unpacking jsonschema 13:37:59 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:37:59 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:37:59 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:37:59 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:37:59 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:37:59 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:38:01 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 13:38:01 INFO - Downloading/unpacking functools32 (from jsonschema) 13:38:01 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:38:01 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:38:01 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:38:01 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:38:01 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:38:01 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:38:01 INFO - Downloading functools32-3.2.3-2.tar.gz 13:38:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 13:38:01 INFO - warning: no files found matching '*.txt' 13:38:01 INFO - no previously-included directories found matching 'build' 13:38:01 INFO - no previously-included directories found matching 'dist' 13:38:01 INFO - no previously-included directories found matching '.git*' 13:38:01 INFO - Installing collected packages: jsonschema, functools32 13:38:01 INFO - Running setup.py install for functools32 13:38:01 INFO - warning: no files found matching '*.txt' 13:38:01 INFO - no previously-included directories found matching 'build' 13:38:01 INFO - no previously-included directories found matching 'dist' 13:38:01 INFO - no previously-included directories found matching '.git*' 13:38:01 INFO - Successfully installed jsonschema functools32 13:38:01 INFO - Cleaning up... 13:38:01 INFO - Return code: 0 13:38:01 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 13:38:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:38:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:38:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:38:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:38:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:38:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:38:01 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 0x7f80e3f3af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16308a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fd410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x178c160>, '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 0x178d060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x178d4f0>, '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': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', '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:38:01 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:38:01 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:38:01 INFO - Using env: {'DISPLAY': ':0', 13:38:01 INFO - 'HOME': '/home/cltbld', 13:38:01 INFO - 'LANG': 'en_US.UTF-8', 13:38:01 INFO - 'LANGUAGE': 'en_US:en', 13:38:01 INFO - 'LOGNAME': 'cltbld', 13:38:01 INFO - 'MAIL': '/var/mail/cltbld', 13:38:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:38:01 INFO - 'MOZ_NO_REMOTE': '1', 13:38:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:38:01 INFO - 'NO_EM_RESTART': '1', 13:38:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:38:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:38:01 INFO - 'PWD': '/builds/slave/test', 13:38:01 INFO - 'SHELL': '/bin/bash', 13:38:01 INFO - 'SHLVL': '1', 13:38:01 INFO - 'TERM': 'linux', 13:38:01 INFO - 'TMOUT': '86400', 13:38:01 INFO - 'USER': 'cltbld', 13:38:01 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', 13:38:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:38:01 INFO - '_': '/tools/buildbot/bin/python'} 13:38:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:38:01 INFO - Downloading/unpacking flake8 13:38:01 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:38:01 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:38:01 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:38:01 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:38:01 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:38:01 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:38:03 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 13:38:03 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 13:38: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:38: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:38: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:38: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:38: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:38: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:38:04 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 13:38:04 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 13:38:04 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:38:04 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:38:04 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:38:04 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:38:04 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:38:04 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:38:04 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 13:38:04 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:38:04 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:38:04 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:38:04 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:38:04 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:38:04 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:38:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 13:38:04 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 13:38:04 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 13:38:04 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 13:38:04 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 13:38:04 INFO - no previously-included directories found matching 'docs/_build' 13:38:04 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 13:38:04 INFO - Running setup.py install for pep8 13:38:04 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 13:38:04 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 13:38:04 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 13:38:04 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 13:38:04 INFO - no previously-included directories found matching 'docs/_build' 13:38:04 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 13:38:04 INFO - Successfully installed flake8 mccabe pyflakes pep8 13:38:04 INFO - Cleaning up... 13:38:04 INFO - Return code: 0 13:38:04 INFO - Running post-action listener: _resource_record_post_action 13:38:04 INFO - Running post-action listener: _start_resource_monitoring 13:38:04 INFO - Starting resource monitoring. 13:38:04 INFO - ##### 13:38:04 INFO - ##### Running install step. 13:38:04 INFO - ##### 13:38:04 INFO - Running pre-action listener: _resource_record_pre_action 13:38:04 INFO - Running main action method: install 13:38:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:38:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:38:05 INFO - Reading from file tmpfile_stdout 13:38:05 INFO - Detecting whether we're running mozinstall >=1.0... 13:38:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 13:38:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 13:38:05 INFO - Reading from file tmpfile_stdout 13:38:05 INFO - Output received: 13:38:05 INFO - Usage: mozinstall [options] installer 13:38:05 INFO - Options: 13:38:05 INFO - -h, --help show this help message and exit 13:38:05 INFO - -d DEST, --destination=DEST 13:38:05 INFO - Directory to install application into. [default: 13:38:05 INFO - "/builds/slave/test"] 13:38:05 INFO - --app=APP Application being installed. [default: firefox] 13:38:05 INFO - mkdir: /builds/slave/test/build/application 13:38:05 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:38:05 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:38:17 INFO - Reading from file tmpfile_stdout 13:38:17 INFO - Output received: 13:38:17 INFO - /builds/slave/test/build/application/firefox/firefox 13:38:17 INFO - Running post-action listener: _resource_record_post_action 13:38:17 INFO - ##### 13:38:17 INFO - ##### Running run-tests step. 13:38:17 INFO - ##### 13:38:17 INFO - Running pre-action listener: _resource_record_pre_action 13:38:17 INFO - Running main action method: run_tests 13:38:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 13:38:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 13:38:17 INFO - Python 2.7.3 13:38:17 INFO - Return code: 0 13:38:17 INFO - grabbing minidump binary from tooltool 13:38:17 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:38:17 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 0x178c160>, '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 0x178d060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x178d4f0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 13:38:17 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:38:17 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:38:17 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 13:38:17 INFO - Return code: 0 13:38:17 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 13:38:17 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 13:38:17 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 13:38:17 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 13:38:17 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 13:38:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 13:38:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 13:38:18 INFO - Return code: 0 13:38:18 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-040', '--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:38:18 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-040 --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:38:18 INFO - Using env: {'DISPLAY': ':0', 13:38:18 INFO - 'HOME': '/home/cltbld', 13:38:18 INFO - 'LANG': 'en_US.UTF-8', 13:38:18 INFO - 'LANGUAGE': 'en_US:en', 13:38:18 INFO - 'LOGNAME': 'cltbld', 13:38:18 INFO - 'MAIL': '/var/mail/cltbld', 13:38:18 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 13:38:18 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 13:38:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:38:18 INFO - 'MOZ_NO_REMOTE': '1', 13:38:18 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 13:38:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:38:18 INFO - 'NO_EM_RESTART': '1', 13:38:18 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:38:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:38:18 INFO - 'PWD': '/builds/slave/test', 13:38:18 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 13:38:18 INFO - 'SHELL': '/bin/bash', 13:38:18 INFO - 'SHLVL': '1', 13:38:18 INFO - 'TERM': 'linux', 13:38:18 INFO - 'TMOUT': '86400', 13:38:18 INFO - 'USER': 'cltbld', 13:38:18 INFO - 'XDG_SESSION_COOKIE': '9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192', 13:38:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:38:18 INFO - '_': '/tools/buildbot/bin/python'} 13:38:18 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-040', '--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:38:19 INFO - mozversion application_buildid: 20160425205003 13:38:19 INFO - mozversion application_changeset: 5bbf2e7c2fc6ff9010b1948e2f11477f48ee36e2 13:38:19 INFO - mozversion application_display_name: Firefox 13:38:19 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 13:38:19 INFO - mozversion application_name: Firefox 13:38:19 INFO - mozversion application_remotingname: firefox 13:38:19 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 13:38:19 INFO - mozversion application_vendor: Mozilla 13:38:19 INFO - mozversion application_version: 47.0 13:38:19 INFO - mozversion platform_buildid: 20160425205003 13:38:19 INFO - mozversion platform_changeset: 5bbf2e7c2fc6ff9010b1948e2f11477f48ee36e2 13:38:19 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 13:38:19 INFO - mozversion platform_version: 47.0 13:38:19 INFO - using testdate: 1461703099 13:38:19 INFO - actual date: 1461703099 13:38:19 INFO - starting webserver on 'localhost:38964' 13:38:19 INFO - SUITE-START | Running 2 tests 13:38:19 INFO - TEST-START | dromaeo_css 13:38:19 INFO - operating with platform_type : linux_ 13:38:19 INFO - Initialising browser for dromaeo_css test... 13:38:19 INFO - TEST-INFO | started process 15838 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpotEXA4/profile http://localhost:38964/getInfo.html) 13:38:22 INFO - PROCESS | 15838 | 13:38:22 INFO - PROCESS | 15838 | (process:15913): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:38:23 INFO - PROCESS | 15838 | __metrics Screen width/height:1600/1200 13:38:23 INFO - PROCESS | 15838 | colorDepth:24 13:38:23 INFO - PROCESS | 15838 | Browser inner width/height: 1024/697 13:38:23 INFO - PROCESS | 15838 | __metrics 13:38:24 ERROR - PROCESS | 15838 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 13:38:25 INFO - TEST-INFO | 15838: exit 0 13:38:25 INFO - Browser initialized. 13:38:25 INFO - Running cycle 1/1 for dromaeo_css test... 13:38:25 INFO - TEST-INFO | started process 15963 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpotEXA4/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:38:27 INFO - PROCESS | 15963 | 13:38:27 INFO - PROCESS | 15963 | (process:16032): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:38:37 INFO - PROCESS | 15963 | RSS: Main: 149745664 13:38:37 INFO - PROCESS | 15963 | 13:39:26 INFO - PROCESS | 15963 | 1461703166616 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:41:34 INFO - PROCESS | 15963 | Cycle 1(1): loaded http://localhost:38964/tests/dromaeo/cssquery-dojo.html (next: http://localhost:38964/tests/dromaeo/cssquery-ext.html) 13:41:35 INFO - PROCESS | 15963 | RSS: Main: 152936448 13:41:35 INFO - PROCESS | 15963 | 13:44:37 INFO - PROCESS | 15963 | Cycle 1(1): loaded http://localhost:38964/tests/dromaeo/cssquery-ext.html (next: http://localhost:38964/tests/dromaeo/cssquery-jquery.html) 13:44:38 INFO - PROCESS | 15963 | RSS: Main: 152055808 13:44:38 INFO - PROCESS | 15963 | 13:47:39 INFO - PROCESS | 15963 | Cycle 1(1): loaded http://localhost:38964/tests/dromaeo/cssquery-jquery.html (next: http://localhost:38964/tests/dromaeo/cssquery-mootools.html) 13:47:40 INFO - PROCESS | 15963 | RSS: Main: 151252992 13:47:40 INFO - PROCESS | 15963 | 13:50:42 INFO - PROCESS | 15963 | Cycle 1(1): loaded http://localhost:38964/tests/dromaeo/cssquery-mootools.html (next: http://localhost:38964/tests/dromaeo/cssquery-prototype.html) 13:50:42 INFO - PROCESS | 15963 | RSS: Main: 152289280 13:50:42 INFO - PROCESS | 15963 | 13:53:44 INFO - PROCESS | 15963 | Cycle 1(1): loaded http://localhost:38964/tests/dromaeo/cssquery-prototype.html (next: http://localhost:38964/tests/dromaeo/cssquery-yui.html) 13:53:45 INFO - PROCESS | 15963 | RSS: Main: 150675456 13:53:45 INFO - PROCESS | 15963 | 13:56:47 INFO - PROCESS | 15963 | Cycle 1(1): loaded http://localhost:38964/tests/dromaeo/cssquery-yui.html (next: http://localhost:38964/tests/dromaeo/cssquery-dojo.html) 13:56:47 INFO - PROCESS | 15963 | RSS: Main: 155201536 13:56:47 INFO - PROCESS | 15963 | 13:56:47 INFO - PROCESS | 15963 | __start_tp_report 13:56:47 INFO - PROCESS | 15963 | _x_x_mozilla_page_load 13:56:47 INFO - PROCESS | 15963 | _x_x_mozilla_page_load_details 13:56:47 INFO - PROCESS | 15963 | |i|pagename|runs| 13:56:47 INFO - PROCESS | 15963 | |0;dojo.html;3395.219099607091;3422.2128910350634;3443.9139021524475;3453.568303962005;3476.72186225102;5583.190437386576;5588.86027849304;5589.552835773138;5605.243292155563;5606.046972014757;5592.86017849554;5624.775008999645;5630.324361076677;5631.155326700987;5645.15322701594;5037.219231019198;5101.158308879049;5149.536541711245;5157.045946499891;5168.689878607295;4979.078870408968;5061.291419201297;5063.164577844651;5182.144946083891;5182.507661772125;5096.490350964911;5148.613853960949;5165.457626949173;5204.9739751301195;5237.764300606482;5164.380274367062;5171.948280517203;5180.6373553851245;5182.844514664547;5214.165733482662;4650.813967441299;4994.850154495371;4997.5002499749735;5192.818251361222;5201.45384734605;5371.435999220064;5383.865403364908;5387.488188622114;5437.34751829779;5440.6735595864375;5988;5998.310194327664;6016.548758843104;6036.758529658809;6041.093835924603;5865.501432378253;6025.945459544562;6067.211262535842;6124.418180272867;6128;5614.354349249888;5622.887542249173;5635.070213414781;5637.8590535236535;5656.745446454878;6117.021276595723;6118.235220597426;6123.203983482119;6142.232220972379;6174.320824709278;5782.190493330937;5969.194158788508;6023.759049638053;6047.939520604826;6079.452849243501;6008.699565021731;6038.5772995889865;6044.455998960115;6061.727222275008;6071.241094863142;5767.653940763567;5981.491573216325;6011.879762404727;6014.909776353358;6028.367021462771;5897.734601942923;5943.197668314809;5955.987482128048;5986.431289027622;5994.07091900756;4544.0457503924545;4579.107074120581;4582.1293954148605;4588.518205588365;4590.88522786933;4009.538903026131;4067.145899361108;4133.483314585676;4146.274401979642;4172.102997855475;5571.637843540238;5640.407757185437;5696.060150075274;5717.970765262293;5782.624129431658;6067.484263837623;6114.296855861633;6119.602225855305;6128.662923539248;6142.109394137825;5574.832755017356;5721.628094173949;5792.797252096157;5794.0439827428845;5803.47768700819;5143.794248230104;5155.072087024297;5158.587313014949;5199.298094757235;5200.739963001834;6165.383461653889;6170.352113028157;6177.62934223948;6202.534809889276;6223.533235007392;5842.444967728059;5999.460048595647;6016.699165041818;6032.487238584769;6087.2999605044215;6293.559450838397;6295.213098362705;6301.873962520815;6309.968450157719;6314.589551679126;6018.668973206516;6026.367231440811;6033.909491357545;6037.63774173551;6040.818775436744;5830.300363956352;6014.609050411709;6082.3613520581475;6101.694915254308;6125.877482450237;5884.676342801187;5907.025340818716;5907.852303692442;5933.465988061095;5943.58394912352;5908.497777688773;5922.378150294329;5928.199693041384;5928.762849485972;5943.316518600243;5643.266375371176;5677.97796396636;5766.048601980794;5792.9710351447975;5794.449527294901;5841.32824725162;5871.4715675589405;5916.763329466773;5928.970355148197;5966.671833049224;5644.238027866186;5822.2140011099655;5828.6211396259105;5830.766769329349;5849.853753656193 13:56:47 INFO - PROCESS | 15963 | |1;ext.html;518.2821791818333;539.9352077750669;558;561.1722709004218;571.0805602979203;38113.237735245275;38543.42184867229;38663.613363866425;38695.61304386959;38972.41541376882;43825.12349753003;44601;44667.32999005017;44678;44815.551844481546;8832.735017949455;9033.774155646095;9045.412048216846;9063.274938004944;9069.31980101495;8916.643334266622;9012.68455604054;9016.41393309436;9026.86459703105;9030.954845225764;9182.678606248783;9220.538973051354;9228.769280768001;9274.211692006187;9311.76720581984;9091.409058411182;9176.541172941326;9211.815763684723;9218.078192180796;9233.676821311255;9053.864192037125;9185.540722963826;9187.816243675155;9194.632214711404;9199.356045076847;42746.78626606878;43229.13541729179;43273.56726432727;43445.56554434447;43499.78250108729;3422.093145316493;3808.6953043756434;3848.7690738555775;3892.2215556888455;3916.3929590913453;29036.70963290382;29106.27234319159;29295.684900137476;29545.409091818045;29599.40801183986;4201.369794530814;4252.362145678142;4255.851045213433;4303.268444364466;4309.612134907873;189710;190248;190610.9999999986;191664;191961;45435.545644543796;45821.31268030982;60258.698706506184;61526.38473615207;61668.383316167165;43318.35022474665;43347;43468.130637387076;43656;43767.56232437699;17122.97262164274;17366.21852016662;17366.913165434093;17368.82631173672;17378.739318910226;13786.517471888636;13876.514321998884;13886.166829990232;13891.722165556834;13976.580702578736;15276.15981121049;15524.223788810514;15636.452724154828;15651.843481565267;15718.764218536731;5931.911021334683;5953.851153721105;5970;6044.24446944132;6045.848853778691;973.5132433783108;1031.5409642709074;1111.4664960818852;1120.921535492524;1195.6711904226406;29190.27024324409;29545.942437782123;29625.703742962294;30018;30736.846315768278;1101.4547798839626;1102.5479553383075;1157.8016752660956;1200.2918278215895;1242.6703427332668;15558.377664893278;15730.370785168465;16057.03657780537;16169.67660646804;16251.59371015734;323882;531737;533037;538005;831990;58666.41333586695;59068.40931590629;59209;59370.70314648399;59773.40226597765;1473.3369983507464;1517.7116347894087;1527.8472152784632;1533.110795738469;1550.6821101674354;30163;30521.54217686781;30712.87967508089;31048;31084.533731993586;48081.75959120182;48804;48917.2662410057;48935;49106.26340604965;300441;300788;301498;301711;302488;34050.659493404746;34488.82755586206;48390.27414588714;49258;49656.50343496663;42230;42774.35838462488;42961.57038429701;43075.784621076695;43342.133157336044;36463.27073458569;36704;36766.816165919;36898;37114.257714845015;38286.85139445821;38416;39058;39445.2110957785;39575;38822.4471021156;39381.606183937794;39621.207575847744;39839.40240896331;39952.60047399605;33992.490112647836;34452.48321275233;34485;34765.47851782175;34883.12792180114;27298.863505683137;27318.453630926873;27323.453530929666;27350.179494615193;27374.863125684245 13:56:47 INFO - PROCESS | 15963 | |2;jquery.html;337.8277078689868;382.55432421229267;384.55041386368833;385.7492629790636;394.469458501016;17733.822661773396;18139.81860181398;18878;18933.810661893378;19001;17040.659186816258;17190;17604.911975440136;17623;17672.469825905213;5533.972330138344;5710.628809127415;5757.309122905257;5762.654240745548;5765.1928729977835;5620.522255608278;6688.765893193739;7011.228764835864;7029.89455158173;7037.049998250248;6873.140857392826;6969.581825090486;6975.372216500514;7012.053372794684;7017.684204210797;7107.324804143598;7114.857702845914;7125.39434148098;7149.999999999948;7200.063991681074;6352;6663.06717059612;6666.733330666768;6861.073755043055;6870.519063665545;22628;23039.76960230393;23365;23811.285661430185;23905.64141537861;2430.1615942499984;2476.6285057241557;2667.2665017120253;2734.357426004887;3201.6798320167795;13504.93247533756;13973.510927117502;14389.784153237606;14403.85596144046;15173.772393414107;2061.2476446097216;2071.3682326890294;2104.105755054096;2104.316097268394;2170.1970270999673;74234.25765742382;77578;77636.99999999943;78031.21968780353;78861.60569197117;14778.669919707278;15534.844651553565;15838.92080539613;15857.841421585637;15873.206339682969;26947.326316842235;27112.86443567809;27349.45301093967;27385.31536711598;27432.17703468899;9968.349720703654;10095.293329466867;10196.592136314464;10396.740081498023;10419.635312764018;8785.648574057093;8815.559222038872;8853.114688531095;8862.822743545223;8897.599608017656;7699.884501732478;7844.686212551434;7898.68405263783;7902.960485197537;7935.722249721232;1838.0958086223734;1913.1677720191483;1928.758905136858;1950.9414717558495;1959.7452331196853;981.8379967305315;1008.5511947183579;1009.152312057875;1010.2322235101229;1127.1152145565854;17501.119570084986;17542.824571754376;17797.644047119244;17989;18485.53786155357;1003.8795344558699;1008.3798463944621;1029.2897900448665;1036.7459972306833;1066.2056767707952;9957;10452.32059916103;10455.790884182426;10486.423246721504;10519.737006574896;344612;346479;348793;349945;458447;73645.6317718408;82660.58669706613;85483.5725821367;85743;86658;1071.8981696738797;1098.7033500954697;1099.8900109988938;1101.091599430473;1122.270524159303;16135.435259766322;16310;16370.754438683667;16393.42623008189;16746.330146793993;34181;35046.47430288497;36487;36764.44853327149;37369.25261494809;51646.74176629093;51669.74165129301;51903.2214516775;52142.739286304844;52579.73710131425;8281.585920703821;8441;8530;8545.444546104483;8669.869951950852;12430.293128876527;12830.486780528674;13251.271180085188;13277.535286264934;13389.330533473481;11137.610183643534;11197.160212984221;11429.085673146295;11497.82753258685;11649.242799218024;11384.260023098472;11538.192326537062;11576.073914086684;11823.290602563873;11924.701882453008;11736.882631173921;11775.764484710087;11847.881521184678;11945.104117191071;12013.45939432745;8343.916560834314;8365.62354694028;8376.162383761575;8378.916210838057;8489.320854331761;11438.485268163118;11609.129315301556;11694.4737486815;11722.765544688888;11759.76480470403 13:56:47 INFO - PROCESS | 15963 | |3;mootools.html;1586.9047857128573;1587.1984647752886;1859.479345783181;1878.6806242938699;1929.3150931419345;7692.115406728228;8409.747707568782;8666.783330416743;8874.023857375683;8910.77723056923;8542.786430339229;8672.783180420492;8713.259372953307;8728.345374096953;8738.432001919886;2411.6382542618617;2454.9140780072703;2468.876556172193;2470.3083136721657;2486.3784053986506;2355.187460326185;2402.4474370894704;2433.9391515212174;2449.191766716979;2452.5953217719057;2345.038534200978;2391.820613453998;2392.3301475586863;2394.126143957452;2418.806495480357;2348.1429278313294;2376.0377047295788;2380.321608341623;2384.6065399209197;2409.168836751318;2379.7382287948312;2381.1070848431837;2383.9046438142454;2402.6876506054277;2402.903883844644;8812.647494100293;8840.425372350777;8859.645614175426;8871.822563548758;8917.242034427081;5403.78384864605;5500.477454641803;5533.3083364579425;5543.196236545678;5547.833564993057;3329.5338652588657;3344.0302312329395;3403.268297316064;3437.9828100859336;3438.7764795288226;964.1900803325241;965.1940629574244;969.0648524174135;990.9355891867006;1002.0931057393071;12405.503779848796;12421.068419868456;12432.813507797391;12442.564510242099;12457.1902826316;4501.144782491317;4694.788734506956;4700.036492519025;4745.928811067837;4793.784279707422;10493.108085812639;10499.475026248658;10578.52396642153;10581.418022008864;10611.257211995086;5370.597205209547;5377.462253774669;5398.946010539923;5401.432849550819;5403.972980135074;4817.084753896748;4827.131116399011;4979.57673597741;4984.37695288089;4993.875153121128;3721.5906250312446;3779.9794055604834;3784.4701741756176;3803.5245594300713;3822.9426558601645;1075.091547642241;1094.2012330998416;1098.5331234225423;1114.8216285394299;1116.2409561498098;1431.3201229415945;1458.3364569121024;1473.9041962272418;1500.579837645461;1524.885633577486;8310.376721745894;8360.540170290693;8384.664613415516;8406.663733450716;8407.95796021016;541.3152362261742;551.3439007580965;553.3553410277062;557.83543854563;561.2731512691075;6193.876122477525;6245.875082498415;6277.121203031579;6288.622682639057;6320.905186422207;10667.519961601747;10928.781424371467;10952.507137178845;11077.833832492519;11144.108471322275;10641.308314959502;10878.619248326271;10896.78206435867;10980.286281391684;11050.226484146033;8355.080941096474;8363.121872203452;8405.159484051668;8409.075001749803;8423.241908228289;7986.041674999037;8017.63920623585;8027.157148499324;8091.231333023354;8200.917990820015;9243.537823108953;9386.859197111913;9480.762980925532;9570.47362395075;9622.326437149612;9563.139317461462;9642.71071867845;9721.70834874955;9858.507074646383;9882.456464894212;7469.626518674153;7639.121501027453;7743.341815945708;7750.573718445539;7789.5715735635085;8397.202265784741;8401.53791541471;8444.451110677786;8456.365772567206;8468.534230617375;7370.44721645868;7522.473426860067;7527.623618819147;7584.962075189589;7656.732014379692;7438.888416673646;7477.700891964478;7513.2111128330735;7547.660355284135;7609.505382150142;7934;7951.642176101974;7971.242731940456;7980.12218655959;8010.83978320442;6950.687219075255;7111.751088711871;7144.928550714426;7155.034070400429;7168.713251469882;7185.2814718527725;7246.384057355184;7247.202807691256;7284.235155308828;7284.854302913806 13:56:47 INFO - PROCESS | 15963 | |4;prototype.html;340.09365042162636;344.5090745687395;346.6066015072892;352.03542294114135;353.6428207510414;6413.29453760086;6420.71106800194;6432.485401167907;6450.838729031777;6501.902471462926;6319.115323854664;6328.873422531558;6332.905006424896;6339.809805705825;6381.7766378176775;4673.719576825401;4775.570198682118;4787.736674482902;4840.201366774478;4872.001239745852;4793.880152996186;4810.110129626013;4815.085133824579;4819.807207711688;4839.7338146401935;4776.522347765231;4779.450363208241;4782.426108866924;4787.640926930477;4789.832355867546;4760.928586071212;4797.7121372717575;4798.4961579034225;4802.951970480303;4816.470188279286;4143.751374917515;4149;4150.315197992328;4167.4790651168605;4168.687348448848;6028.9397106029255;6031.095335699636;6041.879162416771;6051.031834906438;6051.818445446644;5480.972595137038;5545.029619816556;5549.250851135126;5550.250716153308;5551.250581171531;6666.699998500079;6686.431653309474;6690.59856408617;6695.966520167417;6717.059611654372;4543.159515489612;4545.954540454586;4550.590446859798;4551.431071116111;4554.339620754972;6937.514373993822;6996.510244282902;7012.123484564429;7013.509054366145;7015.89476157858;4700.412448443944;4803.471618122004;4806.975965120152;4808.422989241313;4809.0862736080035;4806.663533552618;4834.033193361342;4838.225883858566;4840.322354870321;4842.273658951185;5562.443755624405;5576.637518561281;5597;5599.496045355856;5602.971985140048;6708.597484150869;6727.562708423937;6738.32616738332;6743.494237932076;6744.156980377453;1673.5146807425954;1682.8148903620593;1683.9073850938316;1686.2664740837774;1697.5501492104602;1069.6951368859839;1098.4837126550508;1101.8126918423886;1108.5233349659725;1118.6308518188978;6448.258450278185;6482.67586620667;6487.643179625166;6496.317886621931;6514.54398192122;6961.721531138698;6973.82565435858;6991.580505169706;6994.370506654323;6997.790066298019;6286.18279623646;6467.450266727286;6495.8700825983215;6574.145361103026;6592.9340706593275;3781.962180378161;3822.9426558601645;3823.598522155189;3824.8852534424013;3835.827387767557;7341.302576255247;7347.55914645123;7352.5220860643885;7358.227386124487;7362.484626076231;7197.964010179916;7237.335412855073;7247.057882475245;7252.854942901113;7255.238199988925;7101.89347159793;7299.635018249066;7314.26857314275;7326.230745771723;7340.412766978736;7009.334113259232;7016.614086225102;7029.61337126463;7032.156141263081;7042.154941407064;6928.411085057826;6951.27011663768;6958.652067396712;6959.756408525677;6966.268541803241;7270.345668889825;7304.306090921354;7322.780316590511;7324.487285889936;7326.9267307326245;4546.318052292183;4681.485036646034;4683.157031734184;4688.671792974459;4726.243800991825;6930.237673855972;6939.583624982517;6941.722331106699;6943.340382663639;6955.061066755923;6729.360710732472;6742.6628668567355;6744.595324280559;6747.696353663999;6751.054852320581;6740.66296685154;6754.425873800782;6756.932430675827;6777.559458635173;6778.966105169443;6447.774327898501;6580.967095164494;6622.437092847162;6627.204735431779;6632.867342653217;6694.196696396463;6698.062271282122;6734.696938637675;6746.898796517958;6773.796786096425;6545.738170473128;6588.8023359299295;6592.736290548324;6596.142501474777;6619.4373478252965 13:56:47 INFO - PROCESS | 15963 | |5;yui.html;781.3631890009642;847.9321654267658;914.0859140859145;928.5032507608431;937.96248150074;14224;14548.345324460384;14564.27178641069;14577.927110364433;14641.41434342625;13164.47342106317;13212.14121082129;13272.668183295398;13276.33618319085;13309.933450332735;900.8108297257584;928.7956649537091;933.4772527384653;946.0444950599909;970.5147426286857;957.8611101390294;958.3004406783052;961.8990006049369;964.1419136968104;967.3905439573059;1005.2209537608339;1005.7737009172951;1006.2654262388461;1007.1036777268237;1011.0799172752796;982.3761911186376;987.6641941739807;989.5101924547359;989.5448093876826;989.990100098997;734.4014628078099;734.4601717737459;736.5727877830899;737.6791095873259;738.3023043224156;13627.454901803916;13645.11306765057;13658.795118073138;13668.179909205479;13669.453221871114;13744.587662370144;13859.722805543832;13929.164250145024;13963.371648275852;14037.22795246261;11665.59170429031;11696.47365868538;11755.882441175565;11813.645590632295;11903.464344104535;3835.42468629705;3850.8844734657723;3901.4147877818273;3940.6256405641707;3964.167524819791;50003;50275.497245027815;50475;51286.743566281926;52013;10923.289986150874;10974.725631859268;10990.615328463626;10993.945030274797;11217.831732524019;18604.627907442045;18641.81358186428;18703.34538291153;18754.906225468785;18765.624687506446;8621.31029517637;8814.162654547936;8830.116988301119;8868.201861832466;8951.820963580822;4811.927821082687;4852.878678033077;4860.708357498562;4917.164082106051;4969.155243608523;3549.8225088745976;3569.428891377367;3570.5001299818045;3581.7313701472494;3583.444566092208;601.978930737422;680.8195828105556;681.0975457518807;685.674304705261;686.0326939015963;748.2554857916299;755.4107795919192;766.4519868294085;769.749831304817;773.8568364852521;9234.307426942873;9310.441373517475;9343.392679475812;9686.32195746291;9734.464604446823;560.8121279371456;584.8476710530246;678.7895752316699;700.5691499727733;735.3933005270566;4385.51759306476;4442.53353397895;4491.820327186876;4501.527339629291;4523.705959112647;55541.444585553625;56721.71639141778;56927.43072569221;57073.71463142658;57192;50491.747541262055;50672.49327506678;51473.48526514762;51926.74036629793;52681.736591316796;47223.291650625266;47350.526494734615;47942;48739.26891096636;48775;8753.47479151253;8804.427712198687;8862.246709029805;8878.378513503993;8971.192592666692;33679.158021048686;34585.1353716149;35261;38896;38924;43404;43578.34632480452;43681.56318436775;44138.33792493051;44603.33095003643;12364.62906112818;12555.058370622057;12591.68520786951;12639.93680031594;12669.239845609292;13397.66505837362;13644.386002630104;13647.727045459234;13695.657608559866;14366.56900292993;12803.35983200855;12941.288229147487;13002.544910928073;13023.088383813421;13321.200727955966;11942.223755455867;11992.580259690869;12206.450709717907;12368.19606725596;13089.607311780663;11147.275427097213;12101;12475.93762031184;12583.307918064595;12693.4287957044;10339.379637221791;10369.118624916966;10435.217358697977;10657.680269591925;10838.435611575282;10692.57229710834;10695.411752353695;10912.127029837435;10928.344299342065;10972.177086718688 13:56:47 INFO - PROCESS | 15963 | __end_tp_report 13:56:47 INFO - PROCESS | 15963 | __start_cc_report 13:56:47 INFO - PROCESS | 15963 | _x_x_mozilla_cycle_collect,327 13:56:47 INFO - PROCESS | 15963 | __end_cc_report 13:56:47 INFO - PROCESS | 15963 | __startTimestamp1461704207946__endTimestamp 13:56:47 INFO - PROCESS | 15963 | 13:56:47 INFO - PROCESS | 15963 | ------- Summary: start ------- 13:56:47 INFO - PROCESS | 15963 | Number of tests: 6 13:56:47 INFO - PROCESS | 15963 | 13:56:47 INFO - PROCESS | 15963 | [#0] dojo.html Cycles:165 Average:5594.58 Median:5803.48 stddev:623.99 (10.8%) stddev-sans-first:601.58 13:56:47 INFO - PROCESS | 15963 | Values: 3395.2 3422.2 3443.9 3453.6 3476.7 5583.2 5588.9 5589.6 5605.2 5606.0 5592.9 5624.8 5630.3 5631.2 5645.2 5037.2 5101.2 5149.5 5157.0 5168.7 4979.1 5061.3 5063.2 5182.1 5182.5 5096.5 5148.6 5165.5 5205.0 5237.8 5164.4 5171.9 5180.6 5182.8 5214.2 4650.8 4994.9 4997.5 5192.8 5201.5 5371.4 5383.9 5387.5 5437.3 5440.7 5988.0 5998.3 6016.5 6036.8 6041.1 5865.5 6025.9 6067.2 6124.4 6128.0 5614.4 5622.9 5635.1 5637.9 5656.7 6117.0 6118.2 6123.2 6142.2 6174.3 5782.2 5969.2 6023.8 6047.9 6079.5 6008.7 6038.6 6044.5 6061.7 6071.2 5767.7 5981.5 6011.9 6014.9 6028.4 5897.7 5943.2 5956.0 5986.4 5994.1 4544.0 4579.1 4582.1 4588.5 4590.9 4009.5 4067.1 4133.5 4146.3 4172.1 5571.6 5640.4 5696.1 5718.0 5782.6 6067.5 6114.3 6119.6 6128.7 6142.1 5574.8 5721.6 5792.8 5794.0 5803.5 5143.8 5155.1 5158.6 5199.3 5200.7 6165.4 6170.4 6177.6 6202.5 6223.5 5842.4 5999.5 6016.7 6032.5 6087.3 6293.6 6295.2 6301.9 6310.0 6314.6 6018.7 6026.4 6033.9 6037.6 6040.8 5830.3 6014.6 6082.4 6101.7 6125.9 5884.7 5907.0 5907.9 5933.5 5943.6 5908.5 5922.4 5928.2 5928.8 5943.3 5643.3 5678.0 5766.0 5793.0 5794.4 5841.3 5871.5 5916.8 5929.0 5966.7 5644.2 5822.2 5828.6 5830.8 5849.9 13:56:47 INFO - PROCESS | 15963 | 13:56:47 INFO - PROCESS | 15963 | [#1] ext.html Cycles:180 Average:51567.49 Median:21649.00 stddev:104734.76 (483.8%) stddev-sans-first:104958.44 13:56:47 INFO - PROCESS | 15963 | Values: 518.3 539.9 558.0 561.2 571.1 38113.2 38543.4 38663.6 38695.6 38972.4 43825.1 44601.0 44667.3 44678.0 44815.6 8832.7 9033.8 9045.4 9063.3 9069.3 8916.6 9012.7 9016.4 9026.9 9031.0 9182.7 9220.5 9228.8 9274.2 9311.8 9091.4 9176.5 9211.8 9218.1 9233.7 9053.9 9185.5 9187.8 9194.6 9199.4 42746.8 43229.1 43273.6 43445.6 43499.8 3422.1 3808.7 3848.8 3892.2 3916.4 29036.7 29106.3 29295.7 29545.4 29599.4 4201.4 4252.4 4255.9 4303.3 4309.6 189710.0 190248.0 190611.0 191664.0 191961.0 45435.5 45821.3 60258.7 61526.4 61668.4 43318.4 43347.0 43468.1 43656.0 43767.6 17123.0 17366.2 17366.9 17368.8 17378.7 13786.5 13876.5 13886.2 13891.7 13976.6 15276.2 15524.2 15636.5 15651.8 15718.8 5931.9 5953.9 5970.0 6044.2 6045.8 973.5 1031.5 1111.5 1120.9 1195.7 29190.3 29545.9 29625.7 30018.0 30736.8 1101.5 1102.5 1157.8 1200.3 1242.7 15558.4 15730.4 16057.0 16169.7 16251.6 323882.0 531737.0 533037.0 538005.0 831990.0 58666.4 59068.4 59209.0 59370.7 59773.4 1473.3 1517.7 1527.8 1533.1 1550.7 30163.0 30521.5 30712.9 31048.0 31084.5 48081.8 48804.0 48917.3 48935.0 49106.3 300441.0 300788.0 301498.0 301711.0 302488.0 34050.7 34488.8 48390.3 49258.0 49656.5 42230.0 42774.4 42961.6 43075.8 43342.1 36463.3 36704.0 36766.8 36898.0 37114.3 38286.9 38416.0 39058.0 39445.2 39575.0 38822.4 39381.6 39621.2 39839.4 39952.6 33992.5 34452.5 34485.0 34765.5 34883.1 27298.9 27318.5 27323.5 27350.2 27374.9 13:56:47 INFO - PROCESS | 15963 | 13:56:47 INFO - PROCESS | 15963 | [#2] jquery.html Cycles:180 Average:25710.50 Median:23858.46 stddev:61656.83 (258.4%) stddev-sans-first:61800.36 13:56:47 INFO - PROCESS | 15963 | Values: 337.8 382.6 384.6 385.7 394.5 17733.8 18139.8 18878.0 18933.8 19001.0 17040.7 17190.0 17604.9 17623.0 17672.5 5534.0 5710.6 5757.3 5762.7 5765.2 5620.5 6688.8 7011.2 7029.9 7037.0 6873.1 6969.6 6975.4 7012.1 7017.7 7107.3 7114.9 7125.4 7150.0 7200.1 6352.0 6663.1 6666.7 6861.1 6870.5 22628.0 23039.8 23365.0 23811.3 23905.6 2430.2 2476.6 2667.3 2734.4 3201.7 13504.9 13973.5 14389.8 14403.9 15173.8 2061.2 2071.4 2104.1 2104.3 2170.2 74234.3 77578.0 77637.0 78031.2 78861.6 14778.7 15534.8 15838.9 15857.8 15873.2 26947.3 27112.9 27349.5 27385.3 27432.2 9968.3 10095.3 10196.6 10396.7 10419.6 8785.6 8815.6 8853.1 8862.8 8897.6 7699.9 7844.7 7898.7 7903.0 7935.7 1838.1 1913.2 1928.8 1950.9 1959.7 981.8 1008.6 1009.2 1010.2 1127.1 17501.1 17542.8 17797.6 17989.0 18485.5 1003.9 1008.4 1029.3 1036.7 1066.2 9957.0 10452.3 10455.8 10486.4 10519.7 344612.0 346479.0 348793.0 349945.0 458447.0 73645.6 82660.6 85483.6 85743.0 86658.0 1071.9 1098.7 1099.9 1101.1 1122.3 16135.4 16310.0 16370.8 16393.4 16746.3 34181.0 35046.5 36487.0 36764.4 37369.3 51646.7 51669.7 51903.2 52142.7 52579.7 8281.6 8441.0 8530.0 8545.4 8669.9 12430.3 12830.5 13251.3 13277.5 13389.3 11137.6 11197.2 11429.1 11497.8 11649.2 11384.3 11538.2 11576.1 11823.3 11924.7 11736.9 11775.8 11847.9 11945.1 12013.5 8343.9 8365.6 8376.2 8378.9 8489.3 11438.5 11609.1 11694.5 11722.8 11759.8 13:56:47 INFO - PROCESS | 15963 | 13:56:47 INFO - PROCESS | 15963 | [#3] mootools.html Cycles:180 Average:6117.91 Median:3043.33 stddev:3303.92 (108.6%) stddev-sans-first:3295.63 13:56:47 INFO - PROCESS | 15963 | Values: 1586.9 1587.2 1859.5 1878.7 1929.3 7692.1 8409.7 8666.8 8874.0 8910.8 8542.8 8672.8 8713.3 8728.3 8738.4 2411.6 2454.9 2468.9 2470.3 2486.4 2355.2 2402.4 2433.9 2449.2 2452.6 2345.0 2391.8 2392.3 2394.1 2418.8 2348.1 2376.0 2380.3 2384.6 2409.2 2379.7 2381.1 2383.9 2402.7 2402.9 8812.6 8840.4 8859.6 8871.8 8917.2 5403.8 5500.5 5533.3 5543.2 5547.8 3329.5 3344.0 3403.3 3438.0 3438.8 964.2 965.2 969.1 990.9 1002.1 12405.5 12421.1 12432.8 12442.6 12457.2 4501.1 4694.8 4700.0 4745.9 4793.8 10493.1 10499.5 10578.5 10581.4 10611.3 5370.6 5377.5 5398.9 5401.4 5404.0 4817.1 4827.1 4979.6 4984.4 4993.9 3721.6 3780.0 3784.5 3803.5 3822.9 1075.1 1094.2 1098.5 1114.8 1116.2 1431.3 1458.3 1473.9 1500.6 1524.9 8310.4 8360.5 8384.7 8406.7 8408.0 541.3 551.3 553.4 557.8 561.3 6193.9 6245.9 6277.1 6288.6 6320.9 10667.5 10928.8 10952.5 11077.8 11144.1 10641.3 10878.6 10896.8 10980.3 11050.2 8355.1 8363.1 8405.2 8409.1 8423.2 7986.0 8017.6 8027.2 8091.2 8200.9 9243.5 9386.9 9480.8 9570.5 9622.3 9563.1 9642.7 9721.7 9858.5 9882.5 7469.6 7639.1 7743.3 7750.6 7789.6 8397.2 8401.5 8444.5 8456.4 8468.5 7370.4 7522.5 7527.6 7585.0 7656.7 7438.9 7477.7 7513.2 7547.7 7609.5 7934.0 7951.6 7971.2 7980.1 8010.8 6950.7 7111.8 7144.9 7155.0 7168.7 7185.3 7246.4 7247.2 7284.2 7284.9 13:56:47 INFO - PROCESS | 15963 | 13:56:47 INFO - PROCESS | 15963 | [#4] prototype.html Cycles:180 Average:5637.35 Median:6449.55 stddev:1725.85 (26.8%) stddev-sans-first:1684.27 13:56:47 INFO - PROCESS | 15963 | Values: 340.1 344.5 346.6 352.0 353.6 6413.3 6420.7 6432.5 6450.8 6501.9 6319.1 6328.9 6332.9 6339.8 6381.8 4673.7 4775.6 4787.7 4840.2 4872.0 4793.9 4810.1 4815.1 4819.8 4839.7 4776.5 4779.5 4782.4 4787.6 4789.8 4760.9 4797.7 4798.5 4803.0 4816.5 4143.8 4149.0 4150.3 4167.5 4168.7 6028.9 6031.1 6041.9 6051.0 6051.8 5481.0 5545.0 5549.3 5550.3 5551.3 6666.7 6686.4 6690.6 6696.0 6717.1 4543.2 4546.0 4550.6 4551.4 4554.3 6937.5 6996.5 7012.1 7013.5 7015.9 4700.4 4803.5 4807.0 4808.4 4809.1 4806.7 4834.0 4838.2 4840.3 4842.3 5562.4 5576.6 5597.0 5599.5 5603.0 6708.6 6727.6 6738.3 6743.5 6744.2 1673.5 1682.8 1683.9 1686.3 1697.6 1069.7 1098.5 1101.8 1108.5 1118.6 6448.3 6482.7 6487.6 6496.3 6514.5 6961.7 6973.8 6991.6 6994.4 6997.8 6286.2 6467.5 6495.9 6574.1 6592.9 3782.0 3822.9 3823.6 3824.9 3835.8 7341.3 7347.6 7352.5 7358.2 7362.5 7198.0 7237.3 7247.1 7252.9 7255.2 7101.9 7299.6 7314.3 7326.2 7340.4 7009.3 7016.6 7029.6 7032.2 7042.2 6928.4 6951.3 6958.7 6959.8 6966.3 7270.3 7304.3 7322.8 7324.5 7326.9 4546.3 4681.5 4683.2 4688.7 4726.2 6930.2 6939.6 6941.7 6943.3 6955.1 6729.4 6742.7 6744.6 6747.7 6751.1 6740.7 6754.4 6756.9 6777.6 6779.0 6447.8 6581.0 6622.4 6627.2 6632.9 6694.2 6698.1 6734.7 6746.9 6773.8 6545.7 6588.8 6592.7 6596.1 6619.4 13:56:47 INFO - PROCESS | 15963 | 13:56:47 INFO - PROCESS | 15963 | [#5] yui.html Cycles:180 Average:14463.19 Median:43491.17 stddev:16039.50 (36.9%) stddev-sans-first:16051.59 13:56:47 INFO - PROCESS | 15963 | Values: 781.4 847.9 914.1 928.5 938.0 14224.0 14548.3 14564.3 14577.9 14641.4 13164.5 13212.1 13272.7 13276.3 13309.9 900.8 928.8 933.5 946.0 970.5 957.9 958.3 961.9 964.1 967.4 1005.2 1005.8 1006.3 1007.1 1011.1 982.4 987.7 989.5 989.5 990.0 734.4 734.5 736.6 737.7 738.3 13627.5 13645.1 13658.8 13668.2 13669.5 13744.6 13859.7 13929.2 13963.4 14037.2 11665.6 11696.5 11755.9 11813.6 11903.5 3835.4 3850.9 3901.4 3940.6 3964.2 50003.0 50275.5 50475.0 51286.7 52013.0 10923.3 10974.7 10990.6 10993.9 11217.8 18604.6 18641.8 18703.3 18754.9 18765.6 8621.3 8814.2 8830.1 8868.2 8951.8 4811.9 4852.9 4860.7 4917.2 4969.2 3549.8 3569.4 3570.5 3581.7 3583.4 602.0 680.8 681.1 685.7 686.0 748.3 755.4 766.5 769.7 773.9 9234.3 9310.4 9343.4 9686.3 9734.5 560.8 584.8 678.8 700.6 735.4 4385.5 4442.5 4491.8 4501.5 4523.7 55541.4 56721.7 56927.4 57073.7 57192.0 50491.7 50672.5 51473.5 51926.7 52681.7 47223.3 47350.5 47942.0 48739.3 48775.0 8753.5 8804.4 8862.2 8878.4 8971.2 33679.2 34585.1 35261.0 38896.0 38924.0 43404.0 43578.3 43681.6 44138.3 44603.3 12364.6 12555.1 12591.7 12639.9 12669.2 13397.7 13644.4 13647.7 13695.7 14366.6 12803.4 12941.3 13002.5 13023.1 13321.2 11942.2 11992.6 12206.5 12368.2 13089.6 11147.3 12101.0 12475.9 12583.3 12693.4 10339.4 10369.1 10435.2 10657.7 10838.4 10692.6 10695.4 10912.1 10928.3 10972.2 13:56:47 INFO - PROCESS | 15963 | -------- Summary: end -------- 13:56:47 INFO - PROCESS | 15963 | 13:56:48 INFO - TEST-INFO | 15963: exit 0 13:56:48 INFO - TEST-OK | dromaeo_css | took 1109525ms 13:56:48 INFO - TEST-START | kraken 13:56:48 INFO - operating with platform_type : linux_ 13:56:48 INFO - Initialising browser for kraken test... 13:56:48 INFO - TEST-INFO | started process 16205 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpAarwbM/profile http://localhost:38964/getInfo.html) 13:56:52 INFO - PROCESS | 16205 | 13:56:52 INFO - PROCESS | 16205 | (process:16282): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:56:52 INFO - PROCESS | 16205 | __metrics Screen width/height:1600/1200 13:56:52 INFO - PROCESS | 16205 | colorDepth:24 13:56:52 INFO - PROCESS | 16205 | Browser inner width/height: 1024/697 13:56:52 INFO - PROCESS | 16205 | __metrics 13:56:53 ERROR - PROCESS | 16205 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 13:56:54 INFO - TEST-INFO | 16205: exit 0 13:56:54 INFO - Browser initialized. 13:56:54 INFO - Running cycle 1/1 for kraken test... 13:56:54 INFO - TEST-INFO | started process 16332 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpAarwbM/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:56:56 INFO - PROCESS | 16332 | 13:56:56 INFO - PROCESS | 16332 | (process:16403): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:57:06 INFO - PROCESS | 16332 | RSS: Main: 150020096 13:57:06 INFO - PROCESS | 16332 | 13:57:08 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:38964/tests/kraken/driver.html?testName=audio-beat-detection) 13:57:09 INFO - PROCESS | 16332 | RSS: Main: 154136576 13:57:09 INFO - PROCESS | 16332 | 13:57:12 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:38964/tests/kraken/driver.html?testName=audio-dft) 13:57:12 INFO - PROCESS | 16332 | RSS: Main: 154411008 13:57:12 INFO - PROCESS | 16332 | 13:57:15 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:38964/tests/kraken/driver.html?testName=audio-fft) 13:57:16 INFO - PROCESS | 16332 | RSS: Main: 154923008 13:57:16 INFO - PROCESS | 16332 | 13:57:18 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:38964/tests/kraken/driver.html?testName=audio-oscillator) 13:57:18 INFO - PROCESS | 16332 | RSS: Main: 154890240 13:57:18 INFO - PROCESS | 16332 | 13:57:21 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:38964/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:57:21 INFO - PROCESS | 16332 | RSS: Main: 154722304 13:57:21 INFO - PROCESS | 16332 | 13:57:24 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:38964/tests/kraken/driver.html?testName=imaging-darkroom) 13:57:25 INFO - PROCESS | 16332 | RSS: Main: 155103232 13:57:25 INFO - PROCESS | 16332 | 13:57:28 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:38964/tests/kraken/driver.html?testName=imaging-desaturate) 13:57:29 INFO - PROCESS | 16332 | RSS: Main: 155398144 13:57:29 INFO - PROCESS | 16332 | 13:57:32 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:38964/tests/kraken/driver.html?testName=json-parse-financial) 13:57:32 INFO - PROCESS | 16332 | RSS: Main: 154935296 13:57:32 INFO - PROCESS | 16332 | 13:57:34 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:38964/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:57:34 INFO - PROCESS | 16332 | RSS: Main: 154918912 13:57:34 INFO - PROCESS | 16332 | 13:57:36 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:38964/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:57:37 INFO - PROCESS | 16332 | RSS: Main: 155181056 13:57:37 INFO - PROCESS | 16332 | 13:57:39 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:38964/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:57:39 INFO - PROCESS | 16332 | RSS: Main: 155299840 13:57:39 INFO - PROCESS | 16332 | 13:57:42 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:38964/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:57:42 INFO - PROCESS | 16332 | RSS: Main: 155553792 13:57:42 INFO - PROCESS | 16332 | 13:57:45 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:38964/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:57:46 INFO - PROCESS | 16332 | RSS: Main: 155557888 13:57:46 INFO - PROCESS | 16332 | 13:57:47 INFO - PROCESS | 16332 | Cycle 1(1): loaded http://localhost:38964/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:38964/tests/kraken/driver.html?testName=ai-astar) 13:57:48 INFO - PROCESS | 16332 | RSS: Main: 156889088 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | __start_tp_report 13:57:48 INFO - PROCESS | 16332 | _x_x_mozilla_page_load 13:57:48 INFO - PROCESS | 16332 | _x_x_mozilla_page_load_details 13:57:48 INFO - PROCESS | 16332 | |i|pagename|runs| 13:57:48 INFO - PROCESS | 16332 | |0;ai-astar;112;108;112;111;112;121;112;111;110;113 13:57:48 INFO - PROCESS | 16332 | |1;audio-beat-detection;155;133;168;174;130;158;165;130;181;128 13:57:48 INFO - PROCESS | 16332 | |2;audio-dft;163;165;161;162;162;161;163;164;164;162 13:57:48 INFO - PROCESS | 16332 | |3;audio-fft;74;77;75;170;77;73;74;76;173;76 13:57:48 INFO - PROCESS | 16332 | |4;audio-oscillator;94;94;144;94;93;94;143;94;93;145 13:57:48 INFO - PROCESS | 16332 | |5;imaging-gaussian-blur;117;118;117;118;117;117;117;118;118;119 13:57:48 INFO - PROCESS | 16332 | |6;imaging-darkroom;147;148;148;148;148;147;148;147;147;147 13:57:48 INFO - PROCESS | 16332 | |7;imaging-desaturate;96;97;95;96;98;99;96;96;96;96 13:57:48 INFO - PROCESS | 16332 | |8;json-parse-financial;58;57;58;56;60;58;58;62;57;60 13:57:48 INFO - PROCESS | 16332 | |9;json-stringify-tinderbox;72;72;72;72;73;73;76;72;72;72 13:57:48 INFO - PROCESS | 16332 | |10;stanford-crypto-aes;79;80;80;79;79;86;79;79;80;86 13:57:48 INFO - PROCESS | 16332 | |11;stanford-crypto-ccm;120;133;116;116;116;116;120;119;115;115 13:57:48 INFO - PROCESS | 16332 | |12;stanford-crypto-pbkdf2;141;153;144;147;151;137;153;146;148;139 13:57:48 INFO - PROCESS | 16332 | |13;stanford-crypto-sha256-iterative;68;69;69;67;75;67;66;66;67;66 13:57:48 INFO - PROCESS | 16332 | __end_tp_report 13:57:48 INFO - PROCESS | 16332 | __start_cc_report 13:57:48 INFO - PROCESS | 16332 | _x_x_mozilla_cycle_collect,807 13:57:48 INFO - PROCESS | 16332 | __end_cc_report 13:57:48 INFO - PROCESS | 16332 | __startTimestamp1461704268018__endTimestamp 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | ------- Summary: start ------- 13:57:48 INFO - PROCESS | 16332 | Number of tests: 14 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#0] ai-astar Cycles:10 Average:112.20 Median:112.00 stddev:3.39 (3.0%) stddev-sans-first:3.60 13:57:48 INFO - PROCESS | 16332 | Values: 112.0 108.0 112.0 111.0 112.0 121.0 112.0 111.0 110.0 113.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#1] audio-beat-detection Cycles:10 Average:152.20 Median:161.50 stddev:20.27 (12.6%) stddev-sans-first:21.48 13:57:48 INFO - PROCESS | 16332 | Values: 155.0 133.0 168.0 174.0 130.0 158.0 165.0 130.0 181.0 128.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#2] audio-dft Cycles:10 Average:162.70 Median:163.00 stddev:1.34 (0.8%) stddev-sans-first:1.41 13:57:48 INFO - PROCESS | 16332 | Values: 163.0 165.0 161.0 162.0 162.0 161.0 163.0 164.0 164.0 162.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#3] audio-fft Cycles:10 Average:94.50 Median:75.50 stddev:40.61 (53.8%) stddev-sans-first:42.39 13:57:48 INFO - PROCESS | 16332 | Values: 74.0 77.0 75.0 170.0 77.0 73.0 74.0 76.0 173.0 76.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#4] audio-oscillator Cycles:10 Average:108.80 Median:94.00 stddev:24.30 (25.8%) stddev-sans-first:25.17 13:57:48 INFO - PROCESS | 16332 | Values: 94.0 94.0 144.0 94.0 93.0 94.0 143.0 94.0 93.0 145.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#5] imaging-gaussian-blur Cycles:10 Average:117.60 Median:118.00 stddev:0.70 (0.6%) stddev-sans-first:0.71 13:57:48 INFO - PROCESS | 16332 | Values: 117.0 118.0 117.0 118.0 117.0 117.0 117.0 118.0 118.0 119.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#6] imaging-darkroom Cycles:10 Average:147.50 Median:148.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 13:57:48 INFO - PROCESS | 16332 | Values: 147.0 148.0 148.0 148.0 148.0 147.0 148.0 147.0 147.0 147.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#7] imaging-desaturate Cycles:10 Average:96.50 Median:96.00 stddev:1.18 (1.2%) stddev-sans-first:1.24 13:57:48 INFO - PROCESS | 16332 | Values: 96.0 97.0 95.0 96.0 98.0 99.0 96.0 96.0 96.0 96.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#8] json-parse-financial Cycles:10 Average:58.40 Median:58.00 stddev:1.78 (3.1%) stddev-sans-first:1.88 13:57:48 INFO - PROCESS | 16332 | Values: 58.0 57.0 58.0 56.0 60.0 58.0 58.0 62.0 57.0 60.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#9] json-stringify-tinderbox Cycles:10 Average:72.60 Median:72.00 stddev:1.26 (1.8%) stddev-sans-first:1.32 13:57:48 INFO - PROCESS | 16332 | Values: 72.0 72.0 72.0 72.0 73.0 73.0 76.0 72.0 72.0 72.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#10] stanford-crypto-aes Cycles:10 Average:80.70 Median:80.00 stddev:2.83 (3.5%) stddev-sans-first:2.93 13:57:48 INFO - PROCESS | 16332 | Values: 79.0 80.0 80.0 79.0 79.0 86.0 79.0 79.0 80.0 86.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#11] stanford-crypto-ccm Cycles:10 Average:118.60 Median:117.50 stddev:5.42 (4.6%) stddev-sans-first:5.73 13:57:48 INFO - PROCESS | 16332 | Values: 120.0 133.0 116.0 116.0 116.0 116.0 120.0 119.0 115.0 115.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:145.90 Median:147.50 stddev:5.65 (3.8%) stddev-sans-first:5.70 13:57:48 INFO - PROCESS | 16332 | Values: 141.0 153.0 144.0 147.0 151.0 137.0 153.0 146.0 148.0 139.0 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - PROCESS | 16332 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.00 Median:67.50 stddev:2.71 (4.0%) stddev-sans-first:2.87 13:57:48 INFO - PROCESS | 16332 | Values: 68.0 69.0 69.0 67.0 75.0 67.0 66.0 66.0 67.0 66.0 13:57:48 INFO - PROCESS | 16332 | -------- Summary: end -------- 13:57:48 INFO - PROCESS | 16332 | 13:57:48 INFO - TEST-INFO | 16332: exit 0 13:57:48 INFO - TEST-OK | kraken | took 60310ms 13:57:48 INFO - SUITE-END | took 1169s 13:57:49 INFO - Completed test suite (00:19:30) 13:57:49 INFO - javascript benchmark 13:57:49 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3395.219099607091, 3422.2128910350634, 3443.9139021524475, 3453.568303962005, 3476.72186225102, 5583.190437386576, 5588.86027849304, 5589.552835773138, 5605.243292155563, 5606.046972014757, 5592.86017849554, 5624.775008999645, 5630.324361076677, 5631.155326700987, 5645.15322701594, 5037.219231019198, 5101.158308879049, 5149.536541711245, 5157.045946499891, 5168.689878607295, 4979.078870408968, 5061.291419201297, 5063.164577844651, 5182.144946083891, 5182.507661772125, 5096.490350964911, 5148.613853960949, 5165.457626949173, 5204.9739751301195, 5237.764300606482, 5164.380274367062, 5171.948280517203, 5180.6373553851245, 5182.844514664547, 5214.165733482662, 4650.813967441299, 4994.850154495371, 4997.5002499749735, 5192.818251361222, 5201.45384734605, 5371.435999220064, 5383.865403364908, 5387.488188622114, 5437.34751829779, 5440.6735595864375, 5988.0, 5998.310194327664, 6016.548758843104, 6036.758529658809, 6041.093835924603, 5865.501432378253, 6025.945459544562, 6067.211262535842, 6124.418180272867, 6128.0, 5614.354349249888, 5622.887542249173, 5635.070213414781, 5637.8590535236535, 5656.745446454878, 6117.021276595723, 6118.235220597426, 6123.203983482119, 6142.232220972379, 6174.320824709278, 5782.190493330937, 5969.194158788508, 6023.759049638053, 6047.939520604826, 6079.452849243501, 6008.699565021731, 6038.5772995889865, 6044.455998960115, 6061.727222275008, 6071.241094863142, 5767.653940763567, 5981.491573216325, 6011.879762404727, 6014.909776353358, 6028.367021462771, 5897.734601942923, 5943.197668314809, 5955.987482128048, 5986.431289027622, 5994.07091900756, 4544.0457503924545, 4579.107074120581, 4582.1293954148605, 4588.518205588365, 4590.88522786933, 4009.538903026131, 4067.145899361108, 4133.483314585676, 4146.274401979642, 4172.102997855475, 5571.637843540238, 5640.407757185437, 5696.060150075274, 5717.970765262293, 5782.624129431658, 6067.484263837623, 6114.296855861633, 6119.602225855305, 6128.662923539248, 6142.109394137825, 5574.832755017356, 5721.628094173949, 5792.797252096157, 5794.0439827428845, 5803.47768700819, 5143.794248230104, 5155.072087024297, 5158.587313014949, 5199.298094757235, 5200.739963001834, 6165.383461653889, 6170.352113028157, 6177.62934223948, 6202.534809889276, 6223.533235007392, 5842.444967728059, 5999.460048595647, 6016.699165041818, 6032.487238584769, 6087.2999605044215, 6293.559450838397, 6295.213098362705, 6301.873962520815, 6309.968450157719, 6314.589551679126, 6018.668973206516, 6026.367231440811, 6033.909491357545, 6037.63774173551, 6040.818775436744, 5830.300363956352, 6014.609050411709, 6082.3613520581475, 6101.694915254308, 6125.877482450237, 5884.676342801187, 5907.025340818716, 5907.852303692442, 5933.465988061095, 5943.58394912352, 5908.497777688773, 5922.378150294329, 5928.199693041384, 5928.762849485972, 5943.316518600243, 5643.266375371176, 5677.97796396636, 5766.048601980794, 5792.9710351447975, 5794.449527294901, 5841.32824725162, 5871.4715675589405, 5916.763329466773, 5928.970355148197, 5966.671833049224, 5644.238027866186, 5822.2140011099655, 5828.6211396259105, 5830.766769329349, 5849.853753656193], "unit": "score", "name": "dojo.html", "value": 5554.4416633781875}, {"lowerIsBetter": false, "replicates": [518.2821791818333, 539.9352077750669, 558.0, 561.1722709004218, 571.0805602979203, 38113.237735245275, 38543.42184867229, 38663.613363866425, 38695.61304386959, 38972.41541376882, 43825.12349753003, 44601.0, 44667.32999005017, 44678.0, 44815.551844481546, 8832.735017949455, 9033.774155646095, 9045.412048216846, 9063.274938004944, 9069.31980101495, 8916.643334266622, 9012.68455604054, 9016.41393309436, 9026.86459703105, 9030.954845225764, 9182.678606248783, 9220.538973051354, 9228.769280768001, 9274.211692006187, 9311.76720581984, 9091.409058411182, 9176.541172941326, 9211.815763684723, 9218.078192180796, 9233.676821311255, 9053.864192037125, 9185.540722963826, 9187.816243675155, 9194.632214711404, 9199.356045076847, 42746.78626606878, 43229.13541729179, 43273.56726432727, 43445.56554434447, 43499.78250108729, 3422.093145316493, 3808.6953043756434, 3848.7690738555775, 3892.2215556888455, 3916.3929590913453, 29036.70963290382, 29106.27234319159, 29295.684900137476, 29545.409091818045, 29599.40801183986, 4201.369794530814, 4252.362145678142, 4255.851045213433, 4303.268444364466, 4309.612134907873, 189710.0, 190248.0, 190610.9999999986, 191664.0, 191961.0, 45435.545644543796, 45821.31268030982, 60258.698706506184, 61526.38473615207, 61668.383316167165, 43318.35022474665, 43347.0, 43468.130637387076, 43656.0, 43767.56232437699, 17122.97262164274, 17366.21852016662, 17366.913165434093, 17368.82631173672, 17378.739318910226, 13786.517471888636, 13876.514321998884, 13886.166829990232, 13891.722165556834, 13976.580702578736, 15276.15981121049, 15524.223788810514, 15636.452724154828, 15651.843481565267, 15718.764218536731, 5931.911021334683, 5953.851153721105, 5970.0, 6044.24446944132, 6045.848853778691, 973.5132433783108, 1031.5409642709074, 1111.4664960818852, 1120.921535492524, 1195.6711904226406, 29190.27024324409, 29545.942437782123, 29625.703742962294, 30018.0, 30736.846315768278, 1101.4547798839626, 1102.5479553383075, 1157.8016752660956, 1200.2918278215895, 1242.6703427332668, 15558.377664893278, 15730.370785168465, 16057.03657780537, 16169.67660646804, 16251.59371015734, 323882.0, 531737.0, 533037.0, 538005.0, 831990.0, 58666.41333586695, 59068.40931590629, 59209.0, 59370.70314648399, 59773.40226597765, 1473.3369983507464, 1517.7116347894087, 1527.8472152784632, 1533.110795738469, 1550.6821101674354, 30163.0, 30521.54217686781, 30712.87967508089, 31048.0, 31084.533731993586, 48081.75959120182, 48804.0, 48917.2662410057, 48935.0, 49106.26340604965, 300441.0, 300788.0, 301498.0, 301711.0, 302488.0, 34050.659493404746, 34488.82755586206, 48390.27414588714, 49258.0, 49656.50343496663, 42230.0, 42774.35838462488, 42961.57038429701, 43075.784621076695, 43342.133157336044, 36463.27073458569, 36704.0, 36766.816165919, 36898.0, 37114.257714845015, 38286.85139445821, 38416.0, 39058.0, 39445.2110957785, 39575.0, 38822.4471021156, 39381.606183937794, 39621.207575847744, 39839.40240896331, 39952.60047399605, 33992.490112647836, 34452.48321275233, 34485.0, 34765.47851782175, 34883.12792180114, 27298.863505683137, 27318.453630926873, 27323.453530929666, 27350.179494615193, 27374.863125684245], "unit": "score", "name": "ext.html", "value": 19227.303979528326}, {"lowerIsBetter": false, "replicates": [337.8277078689868, 382.55432421229267, 384.55041386368833, 385.7492629790636, 394.469458501016, 17733.822661773396, 18139.81860181398, 18878.0, 18933.810661893378, 19001.0, 17040.659186816258, 17190.0, 17604.911975440136, 17623.0, 17672.469825905213, 5533.972330138344, 5710.628809127415, 5757.309122905257, 5762.654240745548, 5765.1928729977835, 5620.522255608278, 6688.765893193739, 7011.228764835864, 7029.89455158173, 7037.049998250248, 6873.140857392826, 6969.581825090486, 6975.372216500514, 7012.053372794684, 7017.684204210797, 7107.324804143598, 7114.857702845914, 7125.39434148098, 7149.999999999948, 7200.063991681074, 6352.0, 6663.06717059612, 6666.733330666768, 6861.073755043055, 6870.519063665545, 22628.0, 23039.76960230393, 23365.0, 23811.285661430185, 23905.64141537861, 2430.1615942499984, 2476.6285057241557, 2667.2665017120253, 2734.357426004887, 3201.6798320167795, 13504.93247533756, 13973.510927117502, 14389.784153237606, 14403.85596144046, 15173.772393414107, 2061.2476446097216, 2071.3682326890294, 2104.105755054096, 2104.316097268394, 2170.1970270999673, 74234.25765742382, 77578.0, 77636.99999999943, 78031.21968780353, 78861.60569197117, 14778.669919707278, 15534.844651553565, 15838.92080539613, 15857.841421585637, 15873.206339682969, 26947.326316842235, 27112.86443567809, 27349.45301093967, 27385.31536711598, 27432.17703468899, 9968.349720703654, 10095.293329466867, 10196.592136314464, 10396.740081498023, 10419.635312764018, 8785.648574057093, 8815.559222038872, 8853.114688531095, 8862.822743545223, 8897.599608017656, 7699.884501732478, 7844.686212551434, 7898.68405263783, 7902.960485197537, 7935.722249721232, 1838.0958086223734, 1913.1677720191483, 1928.758905136858, 1950.9414717558495, 1959.7452331196853, 981.8379967305315, 1008.5511947183579, 1009.152312057875, 1010.2322235101229, 1127.1152145565854, 17501.119570084986, 17542.824571754376, 17797.644047119244, 17989.0, 18485.53786155357, 1003.8795344558699, 1008.3798463944621, 1029.2897900448665, 1036.7459972306833, 1066.2056767707952, 9957.0, 10452.32059916103, 10455.790884182426, 10486.423246721504, 10519.737006574896, 344612.0, 346479.0, 348793.0, 349945.0, 458447.0, 73645.6317718408, 82660.58669706613, 85483.5725821367, 85743.0, 86658.0, 1071.8981696738797, 1098.7033500954697, 1099.8900109988938, 1101.091599430473, 1122.270524159303, 16135.435259766322, 16310.0, 16370.754438683667, 16393.42623008189, 16746.330146793993, 34181.0, 35046.47430288497, 36487.0, 36764.44853327149, 37369.25261494809, 51646.74176629093, 51669.74165129301, 51903.2214516775, 52142.739286304844, 52579.73710131425, 8281.585920703821, 8441.0, 8530.0, 8545.444546104483, 8669.869951950852, 12430.293128876527, 12830.486780528674, 13251.271180085188, 13277.535286264934, 13389.330533473481, 11137.610183643534, 11197.160212984221, 11429.085673146295, 11497.82753258685, 11649.242799218024, 11384.260023098472, 11538.192326537062, 11576.073914086684, 11823.290602563873, 11924.701882453008, 11736.882631173921, 11775.764484710087, 11847.881521184678, 11945.104117191071, 12013.45939432745, 8343.916560834314, 8365.62354694028, 8376.162383761575, 8378.916210838057, 8489.320854331761, 11438.485268163118, 11609.129315301556, 11694.4737486815, 11722.765544688888, 11759.76480470403], "unit": "score", "name": "jquery.html", "value": 9781.451881569414}, {"lowerIsBetter": false, "replicates": [1586.9047857128573, 1587.1984647752886, 1859.479345783181, 1878.6806242938699, 1929.3150931419345, 7692.115406728228, 8409.747707568782, 8666.783330416743, 8874.023857375683, 8910.77723056923, 8542.786430339229, 8672.783180420492, 8713.259372953307, 8728.345374096953, 8738.432001919886, 2411.6382542618617, 2454.9140780072703, 2468.876556172193, 2470.3083136721657, 2486.3784053986506, 2355.187460326185, 2402.4474370894704, 2433.9391515212174, 2449.191766716979, 2452.5953217719057, 2345.038534200978, 2391.820613453998, 2392.3301475586863, 2394.126143957452, 2418.806495480357, 2348.1429278313294, 2376.0377047295788, 2380.321608341623, 2384.6065399209197, 2409.168836751318, 2379.7382287948312, 2381.1070848431837, 2383.9046438142454, 2402.6876506054277, 2402.903883844644, 8812.647494100293, 8840.425372350777, 8859.645614175426, 8871.822563548758, 8917.242034427081, 5403.78384864605, 5500.477454641803, 5533.3083364579425, 5543.196236545678, 5547.833564993057, 3329.5338652588657, 3344.0302312329395, 3403.268297316064, 3437.9828100859336, 3438.7764795288226, 964.1900803325241, 965.1940629574244, 969.0648524174135, 990.9355891867006, 1002.0931057393071, 12405.503779848796, 12421.068419868456, 12432.813507797391, 12442.564510242099, 12457.1902826316, 4501.144782491317, 4694.788734506956, 4700.036492519025, 4745.928811067837, 4793.784279707422, 10493.108085812639, 10499.475026248658, 10578.52396642153, 10581.418022008864, 10611.257211995086, 5370.597205209547, 5377.462253774669, 5398.946010539923, 5401.432849550819, 5403.972980135074, 4817.084753896748, 4827.131116399011, 4979.57673597741, 4984.37695288089, 4993.875153121128, 3721.5906250312446, 3779.9794055604834, 3784.4701741756176, 3803.5245594300713, 3822.9426558601645, 1075.091547642241, 1094.2012330998416, 1098.5331234225423, 1114.8216285394299, 1116.2409561498098, 1431.3201229415945, 1458.3364569121024, 1473.9041962272418, 1500.579837645461, 1524.885633577486, 8310.376721745894, 8360.540170290693, 8384.664613415516, 8406.663733450716, 8407.95796021016, 541.3152362261742, 551.3439007580965, 553.3553410277062, 557.83543854563, 561.2731512691075, 6193.876122477525, 6245.875082498415, 6277.121203031579, 6288.622682639057, 6320.905186422207, 10667.519961601747, 10928.781424371467, 10952.507137178845, 11077.833832492519, 11144.108471322275, 10641.308314959502, 10878.619248326271, 10896.78206435867, 10980.286281391684, 11050.226484146033, 8355.080941096474, 8363.121872203452, 8405.159484051668, 8409.075001749803, 8423.241908228289, 7986.041674999037, 8017.63920623585, 8027.157148499324, 8091.231333023354, 8200.917990820015, 9243.537823108953, 9386.859197111913, 9480.762980925532, 9570.47362395075, 9622.326437149612, 9563.139317461462, 9642.71071867845, 9721.70834874955, 9858.507074646383, 9882.456464894212, 7469.626518674153, 7639.121501027453, 7743.341815945708, 7750.573718445539, 7789.5715735635085, 8397.202265784741, 8401.53791541471, 8444.451110677786, 8456.365772567206, 8468.534230617375, 7370.44721645868, 7522.473426860067, 7527.623618819147, 7584.962075189589, 7656.732014379692, 7438.888416673646, 7477.700891964478, 7513.2111128330735, 7547.660355284135, 7609.505382150142, 7934.0, 7951.642176101974, 7971.242731940456, 7980.12218655959, 8010.83978320442, 6950.687219075255, 7111.751088711871, 7144.928550714426, 7155.034070400429, 7168.713251469882, 7185.2814718527725, 7246.384057355184, 7247.202807691256, 7284.235155308828, 7284.854302913806], "unit": "score", "name": "mootools.html", "value": 4868.549582785739}, {"lowerIsBetter": false, "replicates": [340.09365042162636, 344.5090745687395, 346.6066015072892, 352.03542294114135, 353.6428207510414, 6413.29453760086, 6420.71106800194, 6432.485401167907, 6450.838729031777, 6501.902471462926, 6319.115323854664, 6328.873422531558, 6332.905006424896, 6339.809805705825, 6381.7766378176775, 4673.719576825401, 4775.570198682118, 4787.736674482902, 4840.201366774478, 4872.001239745852, 4793.880152996186, 4810.110129626013, 4815.085133824579, 4819.807207711688, 4839.7338146401935, 4776.522347765231, 4779.450363208241, 4782.426108866924, 4787.640926930477, 4789.832355867546, 4760.928586071212, 4797.7121372717575, 4798.4961579034225, 4802.951970480303, 4816.470188279286, 4143.751374917515, 4149.0, 4150.315197992328, 4167.4790651168605, 4168.687348448848, 6028.9397106029255, 6031.095335699636, 6041.879162416771, 6051.031834906438, 6051.818445446644, 5480.972595137038, 5545.029619816556, 5549.250851135126, 5550.250716153308, 5551.250581171531, 6666.699998500079, 6686.431653309474, 6690.59856408617, 6695.966520167417, 6717.059611654372, 4543.159515489612, 4545.954540454586, 4550.590446859798, 4551.431071116111, 4554.339620754972, 6937.514373993822, 6996.510244282902, 7012.123484564429, 7013.509054366145, 7015.89476157858, 4700.412448443944, 4803.471618122004, 4806.975965120152, 4808.422989241313, 4809.0862736080035, 4806.663533552618, 4834.033193361342, 4838.225883858566, 4840.322354870321, 4842.273658951185, 5562.443755624405, 5576.637518561281, 5597.0, 5599.496045355856, 5602.971985140048, 6708.597484150869, 6727.562708423937, 6738.32616738332, 6743.494237932076, 6744.156980377453, 1673.5146807425954, 1682.8148903620593, 1683.9073850938316, 1686.2664740837774, 1697.5501492104602, 1069.6951368859839, 1098.4837126550508, 1101.8126918423886, 1108.5233349659725, 1118.6308518188978, 6448.258450278185, 6482.67586620667, 6487.643179625166, 6496.317886621931, 6514.54398192122, 6961.721531138698, 6973.82565435858, 6991.580505169706, 6994.370506654323, 6997.790066298019, 6286.18279623646, 6467.450266727286, 6495.8700825983215, 6574.145361103026, 6592.9340706593275, 3781.962180378161, 3822.9426558601645, 3823.598522155189, 3824.8852534424013, 3835.827387767557, 7341.302576255247, 7347.55914645123, 7352.5220860643885, 7358.227386124487, 7362.484626076231, 7197.964010179916, 7237.335412855073, 7247.057882475245, 7252.854942901113, 7255.238199988925, 7101.89347159793, 7299.635018249066, 7314.26857314275, 7326.230745771723, 7340.412766978736, 7009.334113259232, 7016.614086225102, 7029.61337126463, 7032.156141263081, 7042.154941407064, 6928.411085057826, 6951.27011663768, 6958.652067396712, 6959.756408525677, 6966.268541803241, 7270.345668889825, 7304.306090921354, 7322.780316590511, 7324.487285889936, 7326.9267307326245, 4546.318052292183, 4681.485036646034, 4683.157031734184, 4688.671792974459, 4726.243800991825, 6930.237673855972, 6939.583624982517, 6941.722331106699, 6943.340382663639, 6955.061066755923, 6729.360710732472, 6742.6628668567355, 6744.595324280559, 6747.696353663999, 6751.054852320581, 6740.66296685154, 6754.425873800782, 6756.932430675827, 6777.559458635173, 6778.966105169443, 6447.774327898501, 6580.967095164494, 6622.437092847162, 6627.204735431779, 6632.867342653217, 6694.196696396463, 6698.062271282122, 6734.696938637675, 6746.898796517958, 6773.796786096425, 6545.738170473128, 6588.8023359299295, 6592.736290548324, 6596.142501474777, 6619.4373478252965], "unit": "score", "name": "prototype.html", "value": 5069.928770091929}, {"lowerIsBetter": false, "replicates": [781.3631890009642, 847.9321654267658, 914.0859140859145, 928.5032507608431, 937.96248150074, 14224.0, 14548.345324460384, 14564.27178641069, 14577.927110364433, 14641.41434342625, 13164.47342106317, 13212.14121082129, 13272.668183295398, 13276.33618319085, 13309.933450332735, 900.8108297257584, 928.7956649537091, 933.4772527384653, 946.0444950599909, 970.5147426286857, 957.8611101390294, 958.3004406783052, 961.8990006049369, 964.1419136968104, 967.3905439573059, 1005.2209537608339, 1005.7737009172951, 1006.2654262388461, 1007.1036777268237, 1011.0799172752796, 982.3761911186376, 987.6641941739807, 989.5101924547359, 989.5448093876826, 989.990100098997, 734.4014628078099, 734.4601717737459, 736.5727877830899, 737.6791095873259, 738.3023043224156, 13627.454901803916, 13645.11306765057, 13658.795118073138, 13668.179909205479, 13669.453221871114, 13744.587662370144, 13859.722805543832, 13929.164250145024, 13963.371648275852, 14037.22795246261, 11665.59170429031, 11696.47365868538, 11755.882441175565, 11813.645590632295, 11903.464344104535, 3835.42468629705, 3850.8844734657723, 3901.4147877818273, 3940.6256405641707, 3964.167524819791, 50003.0, 50275.497245027815, 50475.0, 51286.743566281926, 52013.0, 10923.289986150874, 10974.725631859268, 10990.615328463626, 10993.945030274797, 11217.831732524019, 18604.627907442045, 18641.81358186428, 18703.34538291153, 18754.906225468785, 18765.624687506446, 8621.31029517637, 8814.162654547936, 8830.116988301119, 8868.201861832466, 8951.820963580822, 4811.927821082687, 4852.878678033077, 4860.708357498562, 4917.164082106051, 4969.155243608523, 3549.8225088745976, 3569.428891377367, 3570.5001299818045, 3581.7313701472494, 3583.444566092208, 601.978930737422, 680.8195828105556, 681.0975457518807, 685.674304705261, 686.0326939015963, 748.2554857916299, 755.4107795919192, 766.4519868294085, 769.749831304817, 773.8568364852521, 9234.307426942873, 9310.441373517475, 9343.392679475812, 9686.32195746291, 9734.464604446823, 560.8121279371456, 584.8476710530246, 678.7895752316699, 700.5691499727733, 735.3933005270566, 4385.51759306476, 4442.53353397895, 4491.820327186876, 4501.527339629291, 4523.705959112647, 55541.444585553625, 56721.71639141778, 56927.43072569221, 57073.71463142658, 57192.0, 50491.747541262055, 50672.49327506678, 51473.48526514762, 51926.74036629793, 52681.736591316796, 47223.291650625266, 47350.526494734615, 47942.0, 48739.26891096636, 48775.0, 8753.47479151253, 8804.427712198687, 8862.246709029805, 8878.378513503993, 8971.192592666692, 33679.158021048686, 34585.1353716149, 35261.0, 38896.0, 38924.0, 43404.0, 43578.34632480452, 43681.56318436775, 44138.33792493051, 44603.33095003643, 12364.62906112818, 12555.058370622057, 12591.68520786951, 12639.93680031594, 12669.239845609292, 13397.66505837362, 13644.386002630104, 13647.727045459234, 13695.657608559866, 14366.56900292993, 12803.35983200855, 12941.288229147487, 13002.544910928073, 13023.088383813421, 13321.200727955966, 11942.223755455867, 11992.580259690869, 12206.450709717907, 12368.19606725596, 13089.607311780663, 11147.275427097213, 12101.0, 12475.93762031184, 12583.307918064595, 12693.4287957044, 10339.379637221791, 10369.118624916966, 10435.217358697977, 10657.680269591925, 10838.435611575282, 10692.57229710834, 10695.411752353695, 10912.127029837435, 10928.344299342065, 10972.177086718688], "unit": "score", "name": "yui.html", "value": 6912.662214494525}], "name": "dromaeo_css", "value": 7501.948378509024}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 108.0, 112.0, 111.0, 112.0, 121.0, 112.0, 111.0, 110.0, 113.0], "unit": "score", "name": "ai-astar", "value": 112.2}, {"lowerIsBetter": true, "replicates": [155.0, 133.0, 168.0, 174.0, 130.0, 158.0, 165.0, 130.0, 181.0, 128.0], "unit": "score", "name": "audio-beat-detection", "value": 152.2}, {"lowerIsBetter": true, "replicates": [163.0, 165.0, 161.0, 162.0, 162.0, 161.0, 163.0, 164.0, 164.0, 162.0], "unit": "score", "name": "audio-dft", "value": 162.7}, {"lowerIsBetter": true, "replicates": [74.0, 77.0, 75.0, 170.0, 77.0, 73.0, 74.0, 76.0, 173.0, 76.0], "unit": "score", "name": "audio-fft", "value": 94.5}, {"lowerIsBetter": true, "replicates": [94.0, 94.0, 144.0, 94.0, 93.0, 94.0, 143.0, 94.0, 93.0, 145.0], "unit": "score", "name": "audio-oscillator", "value": 108.8}, {"lowerIsBetter": true, "replicates": [117.0, 118.0, 117.0, 118.0, 117.0, 117.0, 117.0, 118.0, 118.0, 119.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.6}, {"lowerIsBetter": true, "replicates": [147.0, 148.0, 148.0, 148.0, 148.0, 147.0, 148.0, 147.0, 147.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 147.5}, {"lowerIsBetter": true, "replicates": [96.0, 97.0, 95.0, 96.0, 98.0, 99.0, 96.0, 96.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.5}, {"lowerIsBetter": true, "replicates": [58.0, 57.0, 58.0, 56.0, 60.0, 58.0, 58.0, 62.0, 57.0, 60.0], "unit": "score", "name": "json-parse-financial", "value": 58.4}, {"lowerIsBetter": true, "replicates": [72.0, 72.0, 72.0, 72.0, 73.0, 73.0, 76.0, 72.0, 72.0, 72.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 72.6}, {"lowerIsBetter": true, "replicates": [79.0, 80.0, 80.0, 79.0, 79.0, 86.0, 79.0, 79.0, 80.0, 86.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.7}, {"lowerIsBetter": true, "replicates": [120.0, 133.0, 116.0, 116.0, 116.0, 116.0, 120.0, 119.0, 115.0, 115.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 118.6}, {"lowerIsBetter": true, "replicates": [141.0, 153.0, 144.0, 147.0, 151.0, 137.0, 153.0, 146.0, 148.0, 139.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 145.9}, {"lowerIsBetter": true, "replicates": [68.0, 69.0, 69.0, 67.0, 75.0, 67.0, 66.0, 66.0, 67.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 68.0}], "name": "kraken", "value": 1536.1999999999998}]} 13:57:49 INFO - Return code: 0 13:57:49 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 13:57:49 ERROR - # TBPL SUCCESS # 13:57:49 INFO - Running post-action listener: _resource_record_post_action 13:57:49 INFO - Running post-run listener: _resource_record_post_run 13:57:50 INFO - Total resource usage - Wall time: 1184s; CPU: 13.0%; Read bytes: 417792; Write bytes: 244252672; Read time: 24; Write time: 124484 13:57:50 INFO - install - Wall time: 13s; CPU: 13.0%; Read bytes: 0; Write bytes: 13537280; Read time: 0; Write time: 3068 13:57:50 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 417792; Write bytes: 218345472; Read time: 24; Write time: 118888 13:57:50 INFO - Running post-run listener: _upload_blobber_files 13:57:50 INFO - Blob upload gear active. 13:57:50 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:57:50 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:57:50 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:57:50 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:57:50 INFO - (blobuploader) - INFO - Open directory for files ... 13:57:50 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 13:57:50 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:57:50 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:57:51 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 13:57:51 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:57:51 INFO - (blobuploader) - INFO - Done attempting. 13:57:51 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 13:57:51 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:57:51 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:57:52 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 13:57:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:57:52 INFO - (blobuploader) - INFO - Done attempting. 13:57:52 INFO - (blobuploader) - INFO - Iteration through files over. 13:57:52 INFO - Return code: 0 13:57:52 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:57:52 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:57:52 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/43dcde7712ed0e886c9f512ffc59226e4a7de5056b1d084a0d63b5dedbfb0a9026d715526b65b9e6bd5fbe36a07675d2ba4d877af5b9ba8e265341b96af2496b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0ef72c6e100bb50e3b723aec15d4517c694177f7ce4412bda3b21153a2513041dfaafbf4d70b2ac7bbf7dd7a2fcd9da9cd0da2d2c29971464f0a2acd9126c3c3"} 13:57:52 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:57:52 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:57:52 INFO - Contents: 13:57:52 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/43dcde7712ed0e886c9f512ffc59226e4a7de5056b1d084a0d63b5dedbfb0a9026d715526b65b9e6bd5fbe36a07675d2ba4d877af5b9ba8e265341b96af2496b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0ef72c6e100bb50e3b723aec15d4517c694177f7ce4412bda3b21153a2513041dfaafbf4d70b2ac7bbf7dd7a2fcd9da9cd0da2d2c29971464f0a2acd9126c3c3"} 13:57:52 INFO - Running post-run listener: copy_logs_to_upload_dir 13:57:52 INFO - Copying logs to upload dir... 13:57:52 INFO - mkdir: /builds/slave/test/build/upload/logs 13:57:52 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1687.670865 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 28 mins, 7 secs) (at 2016-04-26 13:57:52.194517) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-26 13:57:52.198213) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192 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/43dcde7712ed0e886c9f512ffc59226e4a7de5056b1d084a0d63b5dedbfb0a9026d715526b65b9e6bd5fbe36a07675d2ba4d877af5b9ba8e265341b96af2496b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0ef72c6e100bb50e3b723aec15d4517c694177f7ce4412bda3b21153a2513041dfaafbf4d70b2ac7bbf7dd7a2fcd9da9cd0da2d2c29971464f0a2acd9126c3c3"} 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.011205 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/43dcde7712ed0e886c9f512ffc59226e4a7de5056b1d084a0d63b5dedbfb0a9026d715526b65b9e6bd5fbe36a07675d2ba4d877af5b9ba8e265341b96af2496b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/0ef72c6e100bb50e3b723aec15d4517c694177f7ce4412bda3b21153a2513041dfaafbf4d70b2ac7bbf7dd7a2fcd9da9cd0da2d2c29971464f0a2acd9126c3c3"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-26 13:57:52.223338) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:57:52.223692) ========= 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=9e0dfe3369c33a1556e63f89000001d8-1461702583.216969-1267287192 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004473 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-26 13:57:52.308781) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-26 13:57:52.309110) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-26 13:57:52.309435) ========= ========= Total master_lag: 0.17 =========