builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-054 starttime: 1461921272.83 results: success (0) buildid: 20160428233030 builduid: 5c3f7d6064db4249871a5d2df27b30b5 revision: 37465cb0c50550fd6f673223942b3c479e39e569 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:32.831573) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:32.832049) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:32.832322) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:32.871175) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:32.871456) ========= 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=cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-29 02:14:32-- 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% 222M=0s 2016-04-29 02:14:33 (222 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.126831 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:33.014279) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:33.014590) ========= 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=cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018693 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:33.066561) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:33.066871) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 37465cb0c50550fd6f673223942b3c479e39e569 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 37465cb0c50550fd6f673223942b3c479e39e569 --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=cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-29 02:14:33,150 truncating revision to first 12 chars 2016-04-29 02:14:33,150 Setting DEBUG logging. 2016-04-29 02:14:33,150 attempt 1/10 2016-04-29 02:14:33,150 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/37465cb0c505?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-29 02:14:33,428 unpacking tar archive at: fx-team-37465cb0c505/testing/mozharness/ program finished with exit code 0 elapsedTime=0.557569 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:33.641881) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:33.642208) ========= script_repo_revision: 37465cb0c50550fd6f673223942b3c479e39e569 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:33.642598) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:33.642865) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-29 02:14:33.652797) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 28 secs) (at 2016-04-29 02:14:33.653124) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 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', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 02:14:33 INFO - MultiFileLogger online at 20160429 02:14:33 in /builds/slave/test 02:14:33 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 02:14:33 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 02:14:33 INFO - {'append_to_log': False, 02:14:33 INFO - 'base_work_dir': '/builds/slave/test', 02:14:33 INFO - 'blob_upload_branch': 'Fx-Team', 02:14:33 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 02:14:33 INFO - 'branch': 'Fx-Team', 02:14:33 INFO - 'buildbot_json_path': 'buildprops.json', 02:14:33 INFO - 'config_files': ('talos/linux_config.py',), 02:14:33 INFO - 'default_actions': ('clobber', 02:14:33 INFO - 'read-buildbot-config', 02:14:33 INFO - 'download-and-extract', 02:14:33 INFO - 'populate-webroot', 02:14:33 INFO - 'create-virtualenv', 02:14:33 INFO - 'install', 02:14:33 INFO - 'run-tests'), 02:14:33 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 02:14:33 INFO - 'download_minidump_stackwalk': True, 02:14:33 INFO - 'download_symbols': 'ondemand', 02:14:33 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 02:14:33 INFO - 'tooltool.py': '/tools/tooltool.py', 02:14:33 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 02:14:33 INFO - '/tools/misc-python/virtualenv.py')}, 02:14:33 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 02:14:33 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 02:14:33 INFO - 'installer_path': 'installer.exe', 02:14:33 INFO - 'log_level': 'info', 02:14:33 INFO - 'log_name': 'talos', 02:14:33 INFO - 'log_to_console': True, 02:14:33 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 02:14:33 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 02:14:33 INFO - 'opt_config_files': (), 02:14:33 INFO - 'pip_index': False, 02:14:33 INFO - 'sps_profile': False, 02:14:33 INFO - 'sps_profile_interval': 0, 02:14:33 INFO - 'suite': 'dromaeojs-e10s', 02:14:33 INFO - 'system_bits': '32', 02:14:33 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 02:14:33 INFO - 'title': 'talos-linux64-ix-054', 02:14:33 INFO - 'tooltool_cache': '/builds/tooltool_cache', 02:14:33 INFO - 'use_talos_json': True, 02:14:33 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 02:14:33 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 02:14:33 INFO - 'work_dir': 'build'} 02:14:33 INFO - ##### 02:14:33 INFO - ##### Running clobber step. 02:14:33 INFO - ##### 02:14:33 INFO - Running pre-action listener: _resource_record_pre_action 02:14:33 INFO - Running main action method: clobber 02:14:33 INFO - rmtree: /builds/slave/test/build 02:14:33 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 02:14:34 INFO - Running post-action listener: _resource_record_post_action 02:14:34 INFO - ##### 02:14:34 INFO - ##### Running read-buildbot-config step. 02:14:34 INFO - ##### 02:14:34 INFO - Running pre-action listener: _resource_record_pre_action 02:14:34 INFO - Running main action method: read_buildbot_config 02:14:34 INFO - Using buildbot properties: 02:14:34 INFO - { 02:14:34 INFO - "project": "", 02:14:34 INFO - "product": "firefox", 02:14:34 INFO - "script_repo_revision": "production", 02:14:34 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 02:14:34 INFO - "repository": "", 02:14:34 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 02:14:34 INFO - "buildid": "20160428233030", 02:14:34 INFO - "pgo_build": "True", 02:14:34 INFO - "basedir": "/builds/slave/test", 02:14:34 INFO - "buildnumber": 423, 02:14:34 INFO - "slavename": "talos-linux64-ix-054", 02:14:34 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 02:14:34 INFO - "platform": "ubuntu64_hw", 02:14:34 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 02:14:34 INFO - "branch": "fx-team", 02:14:34 INFO - "repo_path": "integration/fx-team", 02:14:34 INFO - "revision": "37465cb0c50550fd6f673223942b3c479e39e569", 02:14:34 INFO - "stage_platform": "linux64-pgo", 02:14:34 INFO - "builduid": "5c3f7d6064db4249871a5d2df27b30b5", 02:14:34 INFO - "slavebuilddir": "test" 02:14:34 INFO - } 02:14:34 INFO - Found installer url https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2. 02:14:34 INFO - Running post-action listener: _resource_record_post_action 02:14:34 INFO - ##### 02:14:34 INFO - ##### Running download-and-extract step. 02:14:34 INFO - ##### 02:14:34 INFO - Running pre-action listener: _resource_record_pre_action 02:14:34 INFO - Running main action method: download_and_extract 02:14:34 INFO - mkdir: /builds/slave/test/build/tests 02:14:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:14:34 INFO - https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 02:14:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 02:14:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 02:14:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 02:14:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 02:14:35 INFO - Downloaded 1361 bytes. 02:14:35 INFO - Reading from file /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 02:14:35 INFO - Using the following test package requirements: 02:14:35 INFO - {u'common': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 02:14:35 INFO - u'cppunittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 02:14:35 INFO - u'firefox-49.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 02:14:35 INFO - u'gtest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 02:14:35 INFO - u'firefox-49.0a1.en-US.linux-x86_64.gtest.tests.zip'], 02:14:35 INFO - u'jittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 02:14:35 INFO - u'jsshell-linux-x86_64.zip'], 02:14:35 INFO - u'mochitest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 02:14:35 INFO - u'firefox-49.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 02:14:35 INFO - u'mozbase': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 02:14:35 INFO - u'reftest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 02:14:35 INFO - u'firefox-49.0a1.en-US.linux-x86_64.reftest.tests.zip'], 02:14:35 INFO - u'talos': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 02:14:35 INFO - u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'], 02:14:35 INFO - u'web-platform': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 02:14:35 INFO - u'firefox-49.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 02:14:35 INFO - u'xpcshell': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 02:14:35 INFO - u'firefox-49.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 02:14:35 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 02:14:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:14:35 INFO - https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 02:14:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 02:14:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 02:14:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 02:14:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 02:14:36 INFO - Downloaded 23873563 bytes. 02:14:36 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 02:14:36 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 02:14:38 INFO - Return code: 0 02:14:38 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 02:14:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:14:38 INFO - https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 02:14:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 02:14:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 02:14:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 02:14:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 02:14:39 INFO - Downloaded 23873563 bytes. 02:14:39 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 02:14:39 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 02:14:40 INFO - Return code: 0 02:14:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:14:40 INFO - https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 02:14:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 02:14:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 02:14:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 02:14:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 02:14:42 INFO - Downloaded 10840145 bytes. 02:14:42 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 02:14:42 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 02:14:42 INFO - Return code: 0 02:14:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:14:42 INFO - https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 02:14:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 02:14:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 02:14:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 02:14:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 02:14:44 INFO - Downloaded 58401592 bytes. 02:14:44 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 02:14:44 INFO - mkdir: /builds/slave/test/properties 02:14:44 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 02:14:44 INFO - Writing to file /builds/slave/test/properties/build_url 02:14:44 INFO - Contents: 02:14:44 INFO - build_url:https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 02:14:45 INFO - Running post-action listener: _resource_record_post_action 02:14:45 INFO - Running post-action listener: set_extra_try_arguments 02:14:45 INFO - ##### 02:14:45 INFO - ##### Running populate-webroot step. 02:14:45 INFO - ##### 02:14:45 INFO - Running pre-action listener: _resource_record_pre_action 02:14:45 INFO - Running main action method: populate_webroot 02:14:45 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 02:14:45 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 02:14:45 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 02:14:45 INFO - '--tppagecycles', 02:14:45 INFO - '7'], 02:14:45 INFO - 'tests': ['tsvgm']}}, 02:14:45 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 02:14:45 INFO - 'tests': ['tresize', 'tcanvasmark']}, 02:14:45 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 02:14:45 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 02:14:45 INFO - 'tests': ['dromaeo_css', 'kraken']}, 02:14:45 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 02:14:45 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:14:45 INFO - 'talos_options': ['--disable-e10s'], 02:14:45 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:14:45 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:14:45 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:14:45 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:14:45 INFO - 'talos_options': ['--disable-e10s'], 02:14:45 INFO - 'tests': ['damp', 'tps']}, 02:14:45 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:14:45 INFO - 'tests': ['damp', 'tps']}, 02:14:45 INFO - 'g3': {'talos_options': ['--disable-e10s'], 02:14:45 INFO - 'tests': ['dromaeo_dom']}, 02:14:45 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 02:14:45 INFO - 'other': {'talos_options': ['--disable-e10s'], 02:14:45 INFO - 'tests': ['a11yr', 02:14:45 INFO - 'ts_paint', 02:14:45 INFO - 'tpaint', 02:14:45 INFO - 'sessionrestore', 02:14:45 INFO - 'sessionrestore_no_auto_restore', 02:14:45 INFO - 'tabpaint']}, 02:14:45 INFO - 'other-e10s': {'tests': ['a11yr', 02:14:45 INFO - 'ts_paint', 02:14:45 INFO - 'tpaint', 02:14:45 INFO - 'sessionrestore', 02:14:45 INFO - 'sessionrestore_no_auto_restore', 02:14:45 INFO - 'tabpaint']}, 02:14:45 INFO - 'other-e10s_l64': {'tests': ['a11yr', 02:14:45 INFO - 'ts_paint', 02:14:45 INFO - 'tpaint', 02:14:45 INFO - 'sessionrestore', 02:14:45 INFO - 'sessionrestore_no_auto_restore', 02:14:45 INFO - 'tabpaint']}, 02:14:45 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 02:14:45 INFO - 'ts_paint', 02:14:45 INFO - 'tpaint', 02:14:45 INFO - 'sessionrestore', 02:14:45 INFO - 'sessionrestore_no_auto_restore', 02:14:45 INFO - 'tabpaint']}, 02:14:45 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 02:14:45 INFO - 'tests': ['a11yr', 02:14:45 INFO - 'ts_paint', 02:14:45 INFO - 'tpaint', 02:14:45 INFO - 'sessionrestore', 02:14:45 INFO - 'sessionrestore_no_auto_restore', 02:14:45 INFO - 'tabpaint']}, 02:14:45 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 02:14:45 INFO - 'tests': ['a11yr', 02:14:45 INFO - 'ts_paint', 02:14:45 INFO - 'tpaint', 02:14:45 INFO - 'sessionrestore', 02:14:45 INFO - 'sessionrestore_no_auto_restore', 02:14:45 INFO - 'tabpaint']}, 02:14:45 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 02:14:45 INFO - 'tests': ['tsvgx', 02:14:45 INFO - 'tsvgr_opacity', 02:14:45 INFO - 'tart', 02:14:45 INFO - 'tscrollx', 02:14:45 INFO - 'cart']}, 02:14:45 INFO - 'svgr-e10s': {'tests': ['tsvgx', 02:14:45 INFO - 'tsvgr_opacity', 02:14:45 INFO - 'tart', 02:14:45 INFO - 'tscrollx', 02:14:45 INFO - 'cart']}, 02:14:45 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:14:45 INFO - 'talos_options': ['--disable-e10s'], 02:14:45 INFO - 'tests': ['tp5o']}, 02:14:45 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:14:45 INFO - 'tests': ['tp5o']}, 02:14:45 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:14:45 INFO - 'talos_options': ['--disable-e10s', 02:14:45 INFO - '--xperf_path', 02:14:45 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:14:45 INFO - 'tests': ['tp5n']}, 02:14:45 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:14:45 INFO - 'talos_options': ['--xperf_path', 02:14:45 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:14:45 INFO - 'tests': ['tp5n']}}, 02:14:45 INFO - 'talos.zip': {'path': '', 02:14:45 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 02:14:45 INFO - Running post-action listener: _resource_record_post_action 02:14:45 INFO - ##### 02:14:45 INFO - ##### Running create-virtualenv step. 02:14:45 INFO - ##### 02:14:45 INFO - Running pre-action listener: _resource_record_pre_action 02:14:45 INFO - Running main action method: create_virtualenv 02:14:45 INFO - Creating virtualenv /builds/slave/test/build/venv 02:14:45 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 02:14:45 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 02:14:45 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 02:14:45 INFO - Using real prefix '/usr' 02:14:45 INFO - New python executable in /builds/slave/test/build/venv/bin/python 02:14:46 INFO - Installing distribute.............................................................................................................................................................................................done. 02:14:47 INFO - Installing pip.................done. 02:14:48 INFO - Return code: 0 02:14:48 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 02:14: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')]} 02:14:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:14:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:14: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')]} 02:14:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:14:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:14: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb7166e9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f458a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20105a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209f410>, '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 0x20a0310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a07a0>, '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': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', '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 02:14: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', 'pip>=1.5'] in /builds/slave/test/build 02:14: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 pip>=1.5 02:14:48 INFO - Using env: {'DISPLAY': ':0', 02:14:48 INFO - 'HOME': '/home/cltbld', 02:14:48 INFO - 'LANG': 'en_US.UTF-8', 02:14:48 INFO - 'LANGUAGE': 'en_US:en', 02:14:48 INFO - 'LOGNAME': 'cltbld', 02:14:48 INFO - 'MAIL': '/var/mail/cltbld', 02:14:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:14:48 INFO - 'MOZ_NO_REMOTE': '1', 02:14:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:14:48 INFO - 'NO_EM_RESTART': '1', 02:14:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:14:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:14:48 INFO - 'PWD': '/builds/slave/test', 02:14:48 INFO - 'SHELL': '/bin/bash', 02:14:48 INFO - 'SHLVL': '1', 02:14:48 INFO - 'TERM': 'linux', 02:14:48 INFO - 'TMOUT': '86400', 02:14:48 INFO - 'USER': 'cltbld', 02:14:48 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', 02:14:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:14:48 INFO - '_': '/tools/buildbot/bin/python'} 02:14:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:14:48 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 02:14:48 INFO - Cleaning up... 02:14:48 INFO - Return code: 0 02:14:48 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 02:14: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')]} 02:14:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:14:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:14: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')]} 02:14:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:14:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:14: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', '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 0x7fb7166e9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f458a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20105a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209f410>, '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 0x20a0310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a07a0>, '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': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', '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 02:14: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', 'psutil>=0.7.1'] in /builds/slave/test/build 02:14: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 psutil>=0.7.1 02:14:48 INFO - Using env: {'DISPLAY': ':0', 02:14:48 INFO - 'HOME': '/home/cltbld', 02:14:48 INFO - 'LANG': 'en_US.UTF-8', 02:14:48 INFO - 'LANGUAGE': 'en_US:en', 02:14:48 INFO - 'LOGNAME': 'cltbld', 02:14:48 INFO - 'MAIL': '/var/mail/cltbld', 02:14:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:14:48 INFO - 'MOZ_NO_REMOTE': '1', 02:14:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:14:48 INFO - 'NO_EM_RESTART': '1', 02:14:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:14:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:14:48 INFO - 'PWD': '/builds/slave/test', 02:14:48 INFO - 'SHELL': '/bin/bash', 02:14:48 INFO - 'SHLVL': '1', 02:14:48 INFO - 'TERM': 'linux', 02:14:48 INFO - 'TMOUT': '86400', 02:14:48 INFO - 'USER': 'cltbld', 02:14:48 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', 02:14:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:14:48 INFO - '_': '/tools/buildbot/bin/python'} 02:14:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:14:48 INFO - Downloading/unpacking psutil>=0.7.1 02:14: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 02:14: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 02:14: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 02:14: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 02:14: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 02:14: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 02:14:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 02:14:50 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:14:50 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:14:50 INFO - Installing collected packages: psutil 02:14:50 INFO - Running setup.py install for psutil 02:14:50 INFO - building 'psutil._psutil_linux' extension 02:14:50 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 02:14:50 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 02:14:50 INFO - building 'psutil._psutil_posix' extension 02:14:50 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 02:14:50 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 02:14:50 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:14:50 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:14:50 INFO - Successfully installed psutil 02:14:50 INFO - Cleaning up... 02:14:50 INFO - Return code: 0 02:14:50 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 02:14:50 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')]} 02:14:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:14:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:14:50 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')]} 02:14:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:14:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:14:50 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 0x7fb7166e9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f458a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20105a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209f410>, '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 0x20a0310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a07a0>, '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': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', '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 02:14:50 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 02:14:50 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 02:14:50 INFO - Using env: {'DISPLAY': ':0', 02:14:50 INFO - 'HOME': '/home/cltbld', 02:14:50 INFO - 'LANG': 'en_US.UTF-8', 02:14:50 INFO - 'LANGUAGE': 'en_US:en', 02:14:50 INFO - 'LOGNAME': 'cltbld', 02:14:50 INFO - 'MAIL': '/var/mail/cltbld', 02:14:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:14:50 INFO - 'MOZ_NO_REMOTE': '1', 02:14:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:14:50 INFO - 'NO_EM_RESTART': '1', 02:14:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:14:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:14:50 INFO - 'PWD': '/builds/slave/test', 02:14:50 INFO - 'SHELL': '/bin/bash', 02:14:50 INFO - 'SHLVL': '1', 02:14:50 INFO - 'TERM': 'linux', 02:14:50 INFO - 'TMOUT': '86400', 02:14:50 INFO - 'USER': 'cltbld', 02:14:50 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', 02:14:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:14:50 INFO - '_': '/tools/buildbot/bin/python'} 02:14:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:14:51 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 02:14: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 02:14: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 02:14: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 02:14: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 02:14: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 02:14: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 02:14:52 INFO - Downloading mozsystemmonitor-0.0.tar.gz 02:14:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 02:14:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 02:14:53 INFO - Installing collected packages: mozsystemmonitor 02:14:53 INFO - Running setup.py install for mozsystemmonitor 02:14:53 INFO - Successfully installed mozsystemmonitor 02:14:53 INFO - Cleaning up... 02:14:53 INFO - Return code: 0 02:14:53 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 02:14:53 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')]} 02:14:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:14:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:14:53 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')]} 02:14:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:14:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:14:53 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 0x7fb7166e9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f458a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20105a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209f410>, '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 0x20a0310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a07a0>, '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': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', '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 02:14:53 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 02:14:53 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 02:14:53 INFO - Using env: {'DISPLAY': ':0', 02:14:53 INFO - 'HOME': '/home/cltbld', 02:14:53 INFO - 'LANG': 'en_US.UTF-8', 02:14:53 INFO - 'LANGUAGE': 'en_US:en', 02:14:53 INFO - 'LOGNAME': 'cltbld', 02:14:53 INFO - 'MAIL': '/var/mail/cltbld', 02:14:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:14:53 INFO - 'MOZ_NO_REMOTE': '1', 02:14:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:14:53 INFO - 'NO_EM_RESTART': '1', 02:14:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:14:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:14:53 INFO - 'PWD': '/builds/slave/test', 02:14:53 INFO - 'SHELL': '/bin/bash', 02:14:53 INFO - 'SHLVL': '1', 02:14:53 INFO - 'TERM': 'linux', 02:14:53 INFO - 'TMOUT': '86400', 02:14:53 INFO - 'USER': 'cltbld', 02:14:53 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', 02:14:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:14:53 INFO - '_': '/tools/buildbot/bin/python'} 02:14:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:14:53 INFO - Downloading/unpacking blobuploader==1.2.4 02:14:53 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 02:14:53 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 02:14:53 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 02:14:53 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 02:14:53 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 02:14:53 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 02:14:55 INFO - Downloading blobuploader-1.2.4.tar.gz 02:14:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 02:14:55 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 02:14:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:14:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:14:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:14:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:14:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:14:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:14:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 02:14:55 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 02:14:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:14:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:14:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:14:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:14:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:14:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:14:55 INFO - Downloading docopt-0.6.1.tar.gz 02:14:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 02:14:56 INFO - Installing collected packages: blobuploader, requests, docopt 02:14:56 INFO - Running setup.py install for blobuploader 02:14:56 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 02:14:56 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 02:14:56 INFO - Running setup.py install for requests 02:14:56 INFO - Running setup.py install for docopt 02:14:56 INFO - Successfully installed blobuploader requests docopt 02:14:56 INFO - Cleaning up... 02:14:56 INFO - Return code: 0 02:14:56 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:14:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:14:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:14:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:14:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:14:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:14:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:14:56 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 0x7fb7166e9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f458a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20105a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209f410>, '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 0x20a0310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a07a0>, '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': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', '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 02:14:56 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 02:14:56 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 02:14:56 INFO - Using env: {'DISPLAY': ':0', 02:14:56 INFO - 'HOME': '/home/cltbld', 02:14:56 INFO - 'LANG': 'en_US.UTF-8', 02:14:56 INFO - 'LANGUAGE': 'en_US:en', 02:14:56 INFO - 'LOGNAME': 'cltbld', 02:14:56 INFO - 'MAIL': '/var/mail/cltbld', 02:14:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:14:56 INFO - 'MOZ_NO_REMOTE': '1', 02:14:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:14:56 INFO - 'NO_EM_RESTART': '1', 02:14:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:14:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:14:56 INFO - 'PWD': '/builds/slave/test', 02:14:56 INFO - 'SHELL': '/bin/bash', 02:14:56 INFO - 'SHLVL': '1', 02:14:56 INFO - 'TERM': 'linux', 02:14:56 INFO - 'TMOUT': '86400', 02:14:56 INFO - 'USER': 'cltbld', 02:14:56 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', 02:14:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:14:56 INFO - '_': '/tools/buildbot/bin/python'} 02:14:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:14:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:14:56 INFO - Running setup.py (path:/tmp/pip-uVBZff-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:14:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:14:56 INFO - Running setup.py (path:/tmp/pip-3GZxBf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:14:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:14:56 INFO - Running setup.py (path:/tmp/pip-IF92hi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:14:57 INFO - Running setup.py (path:/tmp/pip-Mh8Sgq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:14:57 INFO - Running setup.py (path:/tmp/pip-VFwFEz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:14:57 INFO - Running setup.py (path:/tmp/pip-n30PNd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:14:57 INFO - Running setup.py (path:/tmp/pip-NwNK9G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:14:57 INFO - Running setup.py (path:/tmp/pip-29PiQv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:14:57 INFO - Running setup.py (path:/tmp/pip-RtIcXo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:14:57 INFO - Running setup.py (path:/tmp/pip-LRnT3L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:14:57 INFO - Running setup.py (path:/tmp/pip-CmL5Dv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:14:57 INFO - Running setup.py (path:/tmp/pip-31NS75-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:14:57 INFO - Running setup.py (path:/tmp/pip-7eesG3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:14:57 INFO - Running setup.py (path:/tmp/pip-694OSH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:14:57 INFO - Running setup.py (path:/tmp/pip-QijAFW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:14:57 INFO - Running setup.py (path:/tmp/pip-oMFgp4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:14:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:14:57 INFO - Running setup.py (path:/tmp/pip-YKmpur-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:14:58 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 02:14:58 INFO - Running setup.py install for manifestparser 02:14:58 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 02:14:58 INFO - Running setup.py install for mozcrash 02:14:58 INFO - Running setup.py install for mozdebug 02:14:58 INFO - Running setup.py install for mozdevice 02:14:58 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 02:14:58 INFO - Installing dm script to /builds/slave/test/build/venv/bin 02:14:58 INFO - Running setup.py install for mozfile 02:14:58 INFO - Running setup.py install for mozhttpd 02:14:58 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 02:14:58 INFO - Running setup.py install for mozinfo 02:14:58 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 02:14:58 INFO - Running setup.py install for mozInstall 02:14:58 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 02:14:58 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 02:14:58 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 02:14:58 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 02:14:58 INFO - Running setup.py install for mozleak 02:14:58 INFO - Running setup.py install for mozlog 02:14:59 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 02:14:59 INFO - Running setup.py install for moznetwork 02:14:59 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 02:14:59 INFO - Running setup.py install for mozprocess 02:14:59 INFO - Running setup.py install for mozprofile 02:14:59 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 02:14:59 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 02:14:59 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 02:14:59 INFO - Running setup.py install for mozrunner 02:14:59 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 02:14:59 INFO - Running setup.py install for mozscreenshot 02:14:59 INFO - Running setup.py install for moztest 02:14:59 INFO - Running setup.py install for mozversion 02:14:59 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 02:14:59 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 02:14:59 INFO - Cleaning up... 02:14:59 INFO - Return code: 0 02:14:59 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:14: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')]} 02:14:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:14:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:14: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')]} 02:14:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:14:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:14:59 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 0x7fb7166e9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f458a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20105a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209f410>, '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 0x20a0310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a07a0>, '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': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', '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 02:14:59 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 02:14:59 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 02:14:59 INFO - Using env: {'DISPLAY': ':0', 02:14:59 INFO - 'HOME': '/home/cltbld', 02:14:59 INFO - 'LANG': 'en_US.UTF-8', 02:14:59 INFO - 'LANGUAGE': 'en_US:en', 02:14:59 INFO - 'LOGNAME': 'cltbld', 02:14:59 INFO - 'MAIL': '/var/mail/cltbld', 02:14:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:14:59 INFO - 'MOZ_NO_REMOTE': '1', 02:14:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:14:59 INFO - 'NO_EM_RESTART': '1', 02:14:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:14:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:14:59 INFO - 'PWD': '/builds/slave/test', 02:14:59 INFO - 'SHELL': '/bin/bash', 02:14:59 INFO - 'SHLVL': '1', 02:14:59 INFO - 'TERM': 'linux', 02:14:59 INFO - 'TMOUT': '86400', 02:14:59 INFO - 'USER': 'cltbld', 02:14:59 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', 02:14:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:14:59 INFO - '_': '/tools/buildbot/bin/python'} 02:15:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:15:00 INFO - Running setup.py (path:/tmp/pip-eKAjf9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:15:00 INFO - Running setup.py (path:/tmp/pip-j6DKow-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:15:00 INFO - Running setup.py (path:/tmp/pip-lydLzn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:15:00 INFO - Running setup.py (path:/tmp/pip-edxTG4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:15:00 INFO - Running setup.py (path:/tmp/pip-lK6MJ9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:15:00 INFO - Running setup.py (path:/tmp/pip-fB0_iW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:15:00 INFO - Running setup.py (path:/tmp/pip-_5Uv7J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:15:00 INFO - Running setup.py (path:/tmp/pip-ArfqmX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:15:00 INFO - Running setup.py (path:/tmp/pip-iXhJvW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:15:00 INFO - Running setup.py (path:/tmp/pip-XGRdVD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:15:00 INFO - Running setup.py (path:/tmp/pip-wqoVuM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:15:00 INFO - Running setup.py (path:/tmp/pip-0EvUNL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:15:00 INFO - Running setup.py (path:/tmp/pip-w6THX3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:15:00 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)) 02:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:15:01 INFO - Running setup.py (path:/tmp/pip-_79q5H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:15:01 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)) 02:15:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:15:01 INFO - Running setup.py (path:/tmp/pip-hddbEl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:15:01 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)) 02:15:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:15:01 INFO - Running setup.py (path:/tmp/pip-z0geHv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:15:01 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)) 02:15:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:15:01 INFO - Running setup.py (path:/tmp/pip-4OcKol-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:15:01 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)) 02:15:01 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)) 02:15:01 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)) 02:15:01 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)) 02:15:01 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)) 02:15:01 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)) 02:15:01 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 02:15: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 02:15: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 02:15: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 02:15: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 02:15: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 02:15: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 02:15:03 INFO - Downloading blessings-1.6.tar.gz 02:15:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 02:15:03 INFO - Installing collected packages: blessings 02:15:03 INFO - Running setup.py install for blessings 02:15:03 INFO - Successfully installed blessings 02:15:03 INFO - Cleaning up... 02:15:03 INFO - Return code: 0 02:15:03 INFO - Done creating virtualenv /builds/slave/test/build/venv. 02:15:03 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:15:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:15:03 INFO - Reading from file tmpfile_stdout 02:15:03 INFO - Current package versions: 02:15:03 INFO - argparse == 1.2.1 02:15:03 INFO - blessings == 1.6 02:15:03 INFO - blobuploader == 1.2.4 02:15:03 INFO - docopt == 0.6.1 02:15:03 INFO - manifestparser == 1.1 02:15:03 INFO - mozInstall == 1.12 02:15:03 INFO - mozcrash == 0.17 02:15:03 INFO - mozdebug == 0.1 02:15:03 INFO - mozdevice == 0.48 02:15:03 INFO - mozfile == 1.2 02:15:03 INFO - mozhttpd == 0.7 02:15:03 INFO - mozinfo == 0.9 02:15:03 INFO - mozleak == 0.1 02:15:03 INFO - mozlog == 3.1 02:15:03 INFO - moznetwork == 0.27 02:15:03 INFO - mozprocess == 0.22 02:15:03 INFO - mozprofile == 0.28 02:15:03 INFO - mozrunner == 6.11 02:15:03 INFO - mozscreenshot == 0.1 02:15:03 INFO - mozsystemmonitor == 0.0 02:15:03 INFO - moztest == 0.7 02:15:03 INFO - mozversion == 1.4 02:15:03 INFO - psutil == 3.1.1 02:15:03 INFO - requests == 1.2.3 02:15:03 INFO - wsgiref == 0.1.2 02:15:03 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:15:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:15:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:15:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:03 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 0x7fb7166e9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f458a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20105a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209f410>, '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 0x20a0310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a07a0>, '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': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', '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 02:15:03 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 02:15:03 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 02:15:03 INFO - Using env: {'DISPLAY': ':0', 02:15:03 INFO - 'HOME': '/home/cltbld', 02:15:03 INFO - 'LANG': 'en_US.UTF-8', 02:15:03 INFO - 'LANGUAGE': 'en_US:en', 02:15:03 INFO - 'LOGNAME': 'cltbld', 02:15:03 INFO - 'MAIL': '/var/mail/cltbld', 02:15:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:15:03 INFO - 'MOZ_NO_REMOTE': '1', 02:15:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:15:03 INFO - 'NO_EM_RESTART': '1', 02:15:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:15:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:15:03 INFO - 'PWD': '/builds/slave/test', 02:15:03 INFO - 'SHELL': '/bin/bash', 02:15:03 INFO - 'SHLVL': '1', 02:15:03 INFO - 'TERM': 'linux', 02:15:03 INFO - 'TMOUT': '86400', 02:15:03 INFO - 'USER': 'cltbld', 02:15:03 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', 02:15:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:15:03 INFO - '_': '/tools/buildbot/bin/python'} 02:15:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:15:03 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)) 02:15:03 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)) 02:15:03 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)) 02:15:03 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)) 02:15:03 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)) 02:15:03 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)) 02:15:03 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)) 02:15:03 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)) 02:15:03 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)) 02:15:03 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)) 02:15:03 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)) 02:15:03 INFO - Cleaning up... 02:15:03 INFO - Return code: 0 02:15:03 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 02:15:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:15:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:15:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:03 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb7166e9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f458a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20105a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209f410>, '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 0x20a0310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a07a0>, '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': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', '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 02:15:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 02:15:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 02:15:03 INFO - Using env: {'DISPLAY': ':0', 02:15:03 INFO - 'HOME': '/home/cltbld', 02:15:03 INFO - 'LANG': 'en_US.UTF-8', 02:15:03 INFO - 'LANGUAGE': 'en_US:en', 02:15:03 INFO - 'LOGNAME': 'cltbld', 02:15:03 INFO - 'MAIL': '/var/mail/cltbld', 02:15:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:15:03 INFO - 'MOZ_NO_REMOTE': '1', 02:15:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:15:03 INFO - 'NO_EM_RESTART': '1', 02:15:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:15:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:15:03 INFO - 'PWD': '/builds/slave/test', 02:15:03 INFO - 'SHELL': '/bin/bash', 02:15:03 INFO - 'SHLVL': '1', 02:15:03 INFO - 'TERM': 'linux', 02:15:03 INFO - 'TMOUT': '86400', 02:15:03 INFO - 'USER': 'cltbld', 02:15:03 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', 02:15:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:15:03 INFO - '_': '/tools/buildbot/bin/python'} 02:15:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:15:04 INFO - Downloading/unpacking jsonschema 02:15: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 02:15: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 02:15: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 02:15: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 02:15: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 02:15: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 02:15:05 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 02:15:05 INFO - Downloading/unpacking functools32 (from jsonschema) 02:15:05 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 02:15:05 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 02:15:05 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 02:15:05 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 02:15:05 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 02:15:05 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 02:15:06 INFO - Downloading functools32-3.2.3-2.tar.gz 02:15:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 02:15:06 INFO - warning: no files found matching '*.txt' 02:15:06 INFO - no previously-included directories found matching 'build' 02:15:06 INFO - no previously-included directories found matching 'dist' 02:15:06 INFO - no previously-included directories found matching '.git*' 02:15:06 INFO - Installing collected packages: jsonschema, functools32 02:15:06 INFO - Running setup.py install for functools32 02:15:06 INFO - warning: no files found matching '*.txt' 02:15:06 INFO - no previously-included directories found matching 'build' 02:15:06 INFO - no previously-included directories found matching 'dist' 02:15:06 INFO - no previously-included directories found matching '.git*' 02:15:06 INFO - Successfully installed jsonschema functools32 02:15:06 INFO - Cleaning up... 02:15:06 INFO - Return code: 0 02:15:06 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 02:15:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:15:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:15:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:15:06 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb7166e9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f458a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20105a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209f410>, '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 0x20a0310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a07a0>, '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': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', '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 02:15:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 02:15:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 02:15:06 INFO - Using env: {'DISPLAY': ':0', 02:15:06 INFO - 'HOME': '/home/cltbld', 02:15:06 INFO - 'LANG': 'en_US.UTF-8', 02:15:06 INFO - 'LANGUAGE': 'en_US:en', 02:15:06 INFO - 'LOGNAME': 'cltbld', 02:15:06 INFO - 'MAIL': '/var/mail/cltbld', 02:15:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:15:06 INFO - 'MOZ_NO_REMOTE': '1', 02:15:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:15:06 INFO - 'NO_EM_RESTART': '1', 02:15:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:15:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:15:06 INFO - 'PWD': '/builds/slave/test', 02:15:06 INFO - 'SHELL': '/bin/bash', 02:15:06 INFO - 'SHLVL': '1', 02:15:06 INFO - 'TERM': 'linux', 02:15:06 INFO - 'TMOUT': '86400', 02:15:06 INFO - 'USER': 'cltbld', 02:15:06 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', 02:15:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:15:06 INFO - '_': '/tools/buildbot/bin/python'} 02:15:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:15:06 INFO - Downloading/unpacking flake8 02:15:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:08 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 02:15:08 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 02:15:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:08 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 02:15:08 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 02:15:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:08 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 02:15:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:15:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 02:15:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 02:15:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 02:15:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 02:15:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 02:15:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 02:15:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 02:15:09 INFO - no previously-included directories found matching 'docs/_build' 02:15:09 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 02:15:09 INFO - Running setup.py install for pep8 02:15:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 02:15:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 02:15:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 02:15:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 02:15:09 INFO - no previously-included directories found matching 'docs/_build' 02:15:09 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 02:15:09 INFO - Successfully installed flake8 mccabe pyflakes pep8 02:15:09 INFO - Cleaning up... 02:15:09 INFO - Return code: 0 02:15:09 INFO - Running post-action listener: _resource_record_post_action 02:15:09 INFO - Running post-action listener: _start_resource_monitoring 02:15:09 INFO - Starting resource monitoring. 02:15:09 INFO - ##### 02:15:09 INFO - ##### Running install step. 02:15:09 INFO - ##### 02:15:09 INFO - Running pre-action listener: _resource_record_pre_action 02:15:09 INFO - Running main action method: install 02:15:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:15:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:15:09 INFO - Reading from file tmpfile_stdout 02:15:09 INFO - Detecting whether we're running mozinstall >=1.0... 02:15:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 02:15:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 02:15:09 INFO - Reading from file tmpfile_stdout 02:15:09 INFO - Output received: 02:15:09 INFO - Usage: mozinstall [options] installer 02:15:09 INFO - Options: 02:15:09 INFO - -h, --help show this help message and exit 02:15:09 INFO - -d DEST, --destination=DEST 02:15:09 INFO - Directory to install application into. [default: 02:15:09 INFO - "/builds/slave/test"] 02:15:09 INFO - --app=APP Application being installed. [default: firefox] 02:15:09 INFO - mkdir: /builds/slave/test/build/application 02:15:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 02:15:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 02:15:26 INFO - Reading from file tmpfile_stdout 02:15:26 INFO - Output received: 02:15:26 INFO - /builds/slave/test/build/application/firefox/firefox 02:15:26 INFO - Running post-action listener: _resource_record_post_action 02:15:26 INFO - ##### 02:15:26 INFO - ##### Running run-tests step. 02:15:26 INFO - ##### 02:15:26 INFO - Running pre-action listener: _resource_record_pre_action 02:15:26 INFO - Running main action method: run_tests 02:15:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 02:15:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 02:15:26 INFO - Python 2.7.3 02:15:26 INFO - Return code: 0 02:15:26 INFO - grabbing minidump binary from tooltool 02:15:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 02:15:26 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 0x209f410>, '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 0x20a0310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20a07a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 02:15:26 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 02:15:26 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 02:15:26 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 02:15:26 INFO - Return code: 0 02:15:26 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 02:15:26 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 02:15:26 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 02:15:26 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 02:15:26 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 02:15:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 02:15:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 02:15:27 INFO - Return code: 0 02:15:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-054', '--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 02:15:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-054 --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 02:15:27 INFO - Using env: {'DISPLAY': ':0', 02:15:27 INFO - 'HOME': '/home/cltbld', 02:15:27 INFO - 'LANG': 'en_US.UTF-8', 02:15:27 INFO - 'LANGUAGE': 'en_US:en', 02:15:27 INFO - 'LOGNAME': 'cltbld', 02:15:27 INFO - 'MAIL': '/var/mail/cltbld', 02:15:27 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 02:15:27 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 02:15:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:15:27 INFO - 'MOZ_NO_REMOTE': '1', 02:15:27 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 02:15:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:15:27 INFO - 'NO_EM_RESTART': '1', 02:15:27 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:15:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:15:27 INFO - 'PWD': '/builds/slave/test', 02:15:27 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 02:15:27 INFO - 'SHELL': '/bin/bash', 02:15:27 INFO - 'SHLVL': '1', 02:15:27 INFO - 'TERM': 'linux', 02:15:27 INFO - 'TMOUT': '86400', 02:15:27 INFO - 'USER': 'cltbld', 02:15:27 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691', 02:15:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:15:27 INFO - '_': '/tools/buildbot/bin/python'} 02:15:27 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-054', '--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 02:15:27 INFO - mozversion application_buildid: 20160428233030 02:15:27 INFO - mozversion application_changeset: 37465cb0c50550fd6f673223942b3c479e39e569 02:15:27 INFO - mozversion application_display_name: Nightly 02:15:27 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 02:15:27 INFO - mozversion application_name: Firefox 02:15:27 INFO - mozversion application_remotingname: firefox 02:15:27 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 02:15:27 INFO - mozversion application_vendor: Mozilla 02:15:27 INFO - mozversion application_version: 49.0a1 02:15:27 INFO - mozversion platform_buildid: 20160428233030 02:15:27 INFO - mozversion platform_changeset: 37465cb0c50550fd6f673223942b3c479e39e569 02:15:27 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 02:15:27 INFO - mozversion platform_version: 49.0a1 02:15:27 INFO - using testdate: 1461921327 02:15:27 INFO - actual date: 1461921327 02:15:27 INFO - starting webserver on 'localhost:53998' 02:15:27 INFO - SUITE-START | Running 2 tests 02:15:27 INFO - TEST-START | dromaeo_css 02:15:27 INFO - operating with platform_type : linux_ 02:15:27 INFO - Initialising browser for dromaeo_css test... 02:15:27 INFO - TEST-INFO | started process 5923 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMLVtiy/profile http://localhost:53998/getInfo.html) 02:15:31 INFO - PROCESS | 5923 | 02:15:31 INFO - PROCESS | 5923 | (process:5993): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 02:15:32 INFO - PROCESS | 5923 | __metrics Screen width/height:1600/1200 02:15:32 INFO - PROCESS | 5923 | colorDepth:24 02:15:32 INFO - PROCESS | 5923 | Browser inner width/height: 1024/697 02:15:32 INFO - PROCESS | 5923 | __metrics 02:15:33 ERROR - PROCESS | 5923 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 02:15:33 INFO - TEST-INFO | 5923: exit 0 02:15:33 INFO - Browser initialized. 02:15:33 INFO - Running cycle 1/1 for dromaeo_css test... 02:15:33 INFO - TEST-INFO | started process 6044 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMLVtiy/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:15:35 INFO - PROCESS | 6044 | 02:15:35 INFO - PROCESS | 6044 | (process:6104): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 02:15:45 INFO - PROCESS | 6044 | RSS: Main: 165154816 02:15:45 INFO - PROCESS | 6044 | 02:16:35 INFO - PROCESS | 6044 | 1461921395298 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] 02:18:42 INFO - PROCESS | 6044 | Cycle 1(1): loaded http://localhost:53998/tests/dromaeo/cssquery-dojo.html (next: http://localhost:53998/tests/dromaeo/cssquery-ext.html) 02:18:43 INFO - PROCESS | 6044 | RSS: Main: 169865216 02:18:43 INFO - PROCESS | 6044 | 02:21:45 INFO - PROCESS | 6044 | Cycle 1(1): loaded http://localhost:53998/tests/dromaeo/cssquery-ext.html (next: http://localhost:53998/tests/dromaeo/cssquery-jquery.html) 02:21:46 INFO - PROCESS | 6044 | RSS: Main: 166465536 02:21:46 INFO - PROCESS | 6044 | 02:24:48 INFO - PROCESS | 6044 | Cycle 1(1): loaded http://localhost:53998/tests/dromaeo/cssquery-jquery.html (next: http://localhost:53998/tests/dromaeo/cssquery-mootools.html) 02:24:48 INFO - PROCESS | 6044 | RSS: Main: 167751680 02:24:48 INFO - PROCESS | 6044 | 02:27:50 INFO - PROCESS | 6044 | Cycle 1(1): loaded http://localhost:53998/tests/dromaeo/cssquery-mootools.html (next: http://localhost:53998/tests/dromaeo/cssquery-prototype.html) 02:27:51 INFO - PROCESS | 6044 | RSS: Main: 165556224 02:27:51 INFO - PROCESS | 6044 | 02:30:53 INFO - PROCESS | 6044 | Cycle 1(1): loaded http://localhost:53998/tests/dromaeo/cssquery-prototype.html (next: http://localhost:53998/tests/dromaeo/cssquery-yui.html) 02:30:54 INFO - PROCESS | 6044 | RSS: Main: 166342656 02:30:54 INFO - PROCESS | 6044 | 02:33:56 INFO - PROCESS | 6044 | Cycle 1(1): loaded http://localhost:53998/tests/dromaeo/cssquery-yui.html (next: http://localhost:53998/tests/dromaeo/cssquery-dojo.html) 02:33:56 INFO - PROCESS | 6044 | RSS: Main: 168562688 02:33:56 INFO - PROCESS | 6044 | 02:33:56 INFO - PROCESS | 6044 | __start_tp_report 02:33:56 INFO - PROCESS | 6044 | _x_x_mozilla_page_load 02:33:56 INFO - PROCESS | 6044 | _x_x_mozilla_page_load_details 02:33:56 INFO - PROCESS | 6044 | |i|pagename|runs| 02:33:56 INFO - PROCESS | 6044 | |0;dojo.html;3150.0549835049487;3204.3270913108245;3212.566303549023;3254.9186270343253;3264.412405766961;5347.19792031195;5379.16622923447;5387.488188622085;5409.9729501352485;5417;5281.867953301169;5387.595930305223;5390.676559406438;5489.039418101836;5494.945050549493;4810.735409552473;4867.878303042435;4918.360613120307;4958.181899986498;4978.850634480971;898.2608736228616;4771.498992605779;4824.710517368969;4888.780004899788;4958.404991401037;4882.462929077798;4912.631552633549;4922.11401947651;4937.753112344386;4940.25896115582;4851.854444366674;4898.24077268024;4912.877178070541;4938.013442867812;4942.5304596063315;4827.444843842968;4856.635752318555;4858.611311095139;4876.146674331978;4894.975525122387;5288.0745869472685;5289.841304760864;5297.12597421425;5319.042572336978;5325.1479763238085;5534.280543529316;5654.830355089312;5666.4050274721385;5687.943120568824;5728.541716662657;5695.572832037614;5708.971455142698;5723.027085395493;5754.482096611283;5786.768529258825;5339.012282727708;5344.198370244494;5349.679019258857;5355.518003379676;5360.3299587551555;5665.660060396307;5814.738336774855;5848.912266316009;5866.970665146647;5890.175375447441;5707.543396528268;5712.971435142797;5740.6268592541355;5741.368449470555;5749.568782341341;5671.262735844314;5684.317881854121;5686.545076393879;5690.800821971294;5728.255326807572;5701.287339082614;5718.742656580381;5738.167965644958;5746.9712651436475;5787.2187254720075;5761.078227483583;5762.596618236683;5764.308283006066;5766.876683171552;5802.1296805479515;4236.809343579484;4398.626116780046;4408.801603927831;4412.977935110304;4472.575105364985;3815.3323168445413;3881.184951160288;3924.3328634132267;3930.194310166409;3973.7814420207164;5439.945600543944;5488.313960754906;5491.917621235684;5529.751161197756;5570.220169176318;5557.444255574491;5645.2096706461125;5686.232358631614;5709.657420554697;5722.313322401338;5548.833534993957;5550.833474995757;5588.636738612058;5600.243967064394;5602.635828671123;4861.829835955725;4864.318995340655;4874.975625121851;4896.975515122402;4932.7286999215385;5941.55438342126;6069.575129740876;6070.969645151746;6071.574989750675;6092.086187071975;5750.539956803445;5794.275715535558;5795.043817770021;5825.563082768725;5838.94161058384;6066.575339726177;6101.420365065312;6102.084687296763;6115.388461153849;6119.632822030692;5558.777648893999;5696.829095127153;5706.400827913009;5728.312602487728;5730.054541000688;5806.187133801355;5814.30228372598;5817.981853175762;5829.38791426911;5869.325027621878;5580.051391263414;5620.241267429008;5623.353314368736;5626.099824028136;5637.661740295595;5422.457754224546;5600.523955463831;5641.210230567806;5653.943460565341;5654.802081927113;5477.260569823182;5498.725063746717;5509.586780991362;5516.282883225315;5539.362973258127;5591.4688104629995;5606.775728970795;5613.045782216951;5627.324721033502;5651.689157096399;5377.435369286169;5544.7227638617105;5565.30433695788;5611.354694210218;5615.326160860723 02:33:56 INFO - PROCESS | 6044 | |1;ext.html;601.5548494114354;648.7696867611995;649.5680372552252;667.649484020889;668.4485299627809;36962.81518592407;37833.43249851251;37901;37996.430053549186;38007.619923800754;37897.621023789754;38497.230055398875;38585.421218681746;38670.4199437008;38710.225795484075;8460.746177614667;8564.74305770828;8652.307815374756;8658.740237792876;8673.089325620782;8486.981562212542;8790.780230494225;8795.296376289882;8822.602982865787;8840.646374145026;8846.292296616288;8900.955495222515;8902.777430564223;8929.70519274708;8932.553372331358;8812;8828.735137945872;8866.157715017063;8870.778230544256;8895.066018068106;8721.825563488695;8835.249003834617;8837.513936733541;8840.248578870804;8855.64577416909;28423.57364639532;38385.42421863674;38751.80624096862;38924.80537597322;39001;3329.3674201901563;3397.6092749333898;3405.3700065487715;3445.689887910075;3454.1709989602314;30524;31001.224969375722;31135.844320778477;31342;32448.18879528007;3683.557973043225;3688.409854423306;3694.5751238607636;3723.385641369171;3736.178040831013;225702;229111;229291;229633;231937.84031079905;60847;61291;61434;61731.38268617346;61887.381126188164;57458;58760.41239587635;58775;63836.68081659655;64547.35452645507;16777.664446711242;16834;16898.493045208663;16992.490225293262;17067.914660426617;13020.218786872818;13058.738825223632;13201.141925774795;13213.867861321456;13247.73504529904;20120.496987575134;20294.289699860434;20380.898095509427;20395.18419263213;20417.69373459399;7820.810173151527;7858.803529911684;7897.565633890076;7955.7613271600785;8123.634436450374;972.6741541583507;982.6904525074578;999.9200863068014;1062.9415382153902;1130.9038731707897;31664.36671266562;31711.52432713511;31917.52123718146;31972.680273197435;32796.1800954978;1031.1647565471842;1075.2634445404922;1097.5554900265406;1105.7512059786484;1180.6694125644833;16362.83637163637;16411.42560010394;16422.81785293126;16789;17109.14454277306;499102;506093;506584;507061;508236;55853.72073139608;57192.714036430385;57213.71393143007;57272;57341;1338.5114433231995;1370.9931450342883;1386.272207091285;1386.4454218312553;1479.5931118942162;30712;31283.53074703927;31465;32136;32374.514382283814;50143;51042.744786275834;51100.488995109576;51211;51238.74380628073;420921;429463;429527;430433;430947;28237.57643635306;28696.426071478036;28766.849326026724;28855.56716649294;28919.421611568072;45699;46417.53582464132;46884.53115468802;47766.52233477621;48178.75910620424;39361.21277574375;40225.1954960905;40411.7979410101;40583.39124913188;41581.16837663169;39329.213415730956;39973.60026399815;40654.39018414667;40942.79528602338;41102.17795644011;30988.535171971987;36316;37038.62961370352;38578.80710596429;40747;33178.834105829315;34177.487337689454;34572;34659.13352166216;34703.47944780881;27002;27422.725772742815;27444;27474.5878811814;27952.720472795012 02:33:56 INFO - PROCESS | 6044 | |2;jquery.html;396.2491079404527;404.93116170251056;407.4316328721434;411.0504734064312;414.57506056292294;17936.641267174666;18678.90660546697;18725.62548749026;18777.15502802374;20331.28840490583;19163.808361916377;19385.321513746985;19616.901915490438;20229.291974780885;20300.695489567668;6196.4113409226275;6305.2433707955;6368.426841584256;6374.936250637504;6383.840403989891;6136.171616831737;6486.61080335179;6502.577332473374;6550.148480697502;6557.836054098638;6296.150019747344;6322.336154703736;6325.019621958604;6334.3032266450655;6351.460125889282;6090.756369745205;6330.778422755205;6348.777792777254;6526.869462610721;6598.868022639568;6320.115183874262;6340.746370145189;6359.141515895341;6370.267419246753;6370.77702280418;24460.877695611587;25868.35329116787;25892.35269118268;26245.343866403302;26984.73015269842;2546.172493939477;2554.361409647588;2641.4981153580757;2646.941223510592;2861.3561948561614;15423.228838558027;16015.599610009727;16133.435329763402;16348.509544713677;16629.085400302978;2098.1397626972866;2136.220279597951;2182.9630925310353;2183.290430610058;2244.7418546867157;94861.5256923711;95414;98677.5066124672;99180.0081999178;99886;17180.312787488612;18049.007304598374;18403;18527.166277517543;18653.067346632615;32877.83561082179;32993;33223;33268.50097248543;33301.50047749286;10364;10386.740331491774;10452.268341216042;10506.159507239403;10712.73218169552;8910.955445222733;8918.97668361597;8985;9060.411073280216;9150.222231110298;8794.42836215644;8841.513716745512;8952.8657070144;9004.684836030707;9169.587368568296;3400.880969166067;3612.169201083713;3632.891013269606;3635.8547057676747;3659.853605855736;900.5542256582902;922.9861552076724;950.0357137505438;977.8582105594649;1068.7061058209056;18062.458126256235;18842.152103155116;19044.428667140008;19261.22955081809;19335.323263685987;931.7111695374456;975.22956864078;1004.9346792458467;1006.2352612014921;1039.2413538117066;9916.900830991597;10141.847872281922;10190.949045254874;10194.541245643964;10394.22043346752;361380;371303;371934;520000;540231;93021.53489232645;99410.5029474848;100128;101522.49238753758;101628;984.4487087231173;992.6277645882794;994.8159590475785;1029.711680729382;1031.7884833609091;17129.400470983954;17259.654806904044;17347.913260433616;17449.56376090608;17562.71684680983;39486.210275794896;39579.406308904814;39753.602463976145;40703;40824.183516328914;54607.72696136494;55906.720466397404;56889.43110568841;57826.71086644708;59211;8266.545340006358;8531.573421328785;8755.124487551195;8868.86696699537;8911.06433824439;7699.807504812425;11197.488339074447;12148.817767733315;13767.793483097961;14031.929840351142;9623.951880240835;11045.226834121535;11177.88822111801;11242.156838237;11393.259438136494;11212.943935280271;11795.587154449553;11817.763644727229;11825.645230643095;12015.339156346485;11116.166287528305;11121.777564448828;11194.328340299608;11372.715682108013;11507.136964727846;8338.37462190326;8442.831143377221;8461.06928237881;8493.745187644381;9190.080991900757;8469.110743372104;10345.120664743581;10867.891321086689;10881.129509639051;11023.559057637925 02:33:56 INFO - PROCESS | 6044 | |3;mootools.html;1495.760678291473;1536.162791278753;1636.509047285814;1736.1145815634022;1739.90430526321;7293.854122917539;7858.332041776449;8012.599370031504;8109.9594502027485;8163.551004694739;8252;8272.75181744547;8289.91710082899;8315.459495132813;8326.625301861415;2250.2011785816003;2324.93025209244;2325.4070212095976;2325.883705814711;2328.836981411302;2330.312557795446;2347.248880358286;2354.8704821234824;2356.434455730621;2359.138914296278;2333.125078095714;2352.0591763294647;2358.716953965518;2392.1866565367773;2397.5324811661735;2284.3375421127853;2291.4385975436044;2301.7122859642545;2310.0182422470466;2315.3169814904645;2237.7762223777654;2241.2939923923914;2244.3267019893965;2248.201888329636;2250.6961560189493;8310.958445207736;8369.83260334796;8375.45559538628;8384.8742268866;8410.201030902055;5018.447970723218;5167.767450464738;5178.922316165261;5193.844184674428;5203.271541984125;3036.9544456833164;3091.9536206956914;3178.3643271345823;3191.7127458528844;3231.1922019495128;997.1922742578535;1002.5939494504664;1009.0514915978956;1014.5586669798661;1025.8307379282485;10540.525676344583;10588.364698118137;10600.734981625521;10642.414667193301;10678.893211067867;4396.846110386121;4431.313146462304;4520.796564154621;4521.163584736834;4529.139463501924;9304.209142222986;9331.766705832273;9337.766555836159;9343.345965782466;9369.672061477952;4999.975000125049;5009.924851127236;5011.223260394645;5011.874703132378;5028.572571331478;4176.0395109125075;4601.125786100697;4604.194266003436;4708.4820669726305;4710.24636058229;3976.224636195972;4047.9392809107885;4136.110736191733;4178.770167640809;4186.058136919169;1297.5847728726717;1329.8537160912292;1338.9933050334687;1343.6237853401062;1345.7779466387935;907.0974380491322;931.3527098666361;932.1238036245907;946.9195118414874;948.848184290524;5404.054290499147;5600.0759874620235;5695.487406133385;5695.772169113189;5746.310442746897;411.24125987553515;425.99787001064794;429.57472102618806;432.86148432501295;443.66281625963853;3785.246425433381;3843.135294558702;3861.1505468796818;3904.941425878614;3932.4297976793205;9989.200863930868;10155.39067655943;10501.264911456277;10514.21143414247;10527.420991845522;10372.533236004398;10377.429241391796;10381.636642717469;10418.270721049454;10469.633562825264;7490.962545187239;7824;7839.804004899923;7852.411069169835;7903.2887040165515;5711.600187986801;5767.509761670137;5859.94140058594;5909.438603332676;5999.5500337473995;9633.133018028411;9853.261005424478;9860.950695246765;9863.161631261137;9923.206143508358;9571.234301256021;9692.563834627317;9733.513324333897;9805.754856128653;9923.553440095357;6601.669916504252;7272.23641517633;7405.148407933157;7440.479166458513;7783.299503044753;7696.653650585849;7771.300582947561;7791.415643826849;7803.102643196105;7817.843643127219;6870.3473170048765;7089.255628158969;7138.928610713826;7190.96404517974;7225.5664660120565;6989.790306290616;7124.750633727795;7161.140663120459;7212.639368031682;7239.601821899846;6315.336889626523;6374.043893415839;6396.680165991589;6402.455791257609;6495.772647957298;4798.640101992434;4834.226523756182;4890.55984961341;4907.4111106666;4969.981153863521;4716.221823399101;4766.833160839354;4769.451513076041;4828.758562071953;4869.391326084239 02:33:56 INFO - PROCESS | 6044 | |4;prototype.html;317.79661016949143;330.6544660829433;331.75118661004245;340.3023801207524;341.03827207275486;5363.9080758504215;5381.5963802714805;5402.270693456382;5523.978064058147;5555.305631782305;5366.812161574346;5462.508374246317;5476.151196564539;5477.534409575181;5510.862228444291;4232.555581663927;4252.617264446199;4265.296226122686;4274.615284624383;4279.593438623326;4187.51843537994;4286.807093680792;4295.871123866274;4309.37514060461;4314.158739045887;4186.74879507229;4208.473940757405;4233.576642335757;4261.808218630169;4270.530241673413;4219.2405367033925;4221.577842215769;4235.682323825726;4265.50946641134;4269.188854117708;3664.8900532984053;3759.5112635357227;3768.4158955361963;3768.566614839301;3772.1889793694486;5297.867553311159;5314.73426328682;5331.306930099101;5333.946660533384;5340.85171688085;4848.739327774769;4857.8299759508245;4872.9512704873205;4889.801998510352;4892.9755351223375;5606.719664016824;5681.545476361923;5716.685162412668;5745.396733342981;5752.137179423078;4110.77390743512;4116.629503344683;4118.258713431581;4135.56576559463;4142.565030671796;5860.238169037998;5919.070060320126;5955.940440595626;5958.433948774859;5983.850403739898;4104.4664193654635;4210.45264115663;4222.092250166229;4230.407742915994;4231.830726770895;4289.549597292302;4301.483821941387;4305.461817272841;4305.504866940342;4320.740755554677;4834.564889159922;4835.397628766521;4862.489438608965;4868.707877527359;4885;5643.689597072118;5726.77092916287;5743.0811070228565;5787.536997040227;5791.333996590446;1571.1358752686206;1572.8741700664148;1575.535217110955;1583.3666533386738;1588.5313832419463;1059.7244716373643;1064.590132798878;1075.671920064388;1076.1767248055244;1091.4870011094772;6008.909866352008;6013.548983826143;6033.185519954838;6057.3639767824625;6058.242719660043;6308.495320374359;6311.463525600376;6325.778597749057;6354.809355719336;6390.488760899117;5849.268841394825;5939.2575928009;5980.192673989043;6001.969990150022;6046.244219472566;3364.966350336514;3391.4573668212965;3391.593008838955;3399.558057452515;3409.7954122752712;6507.023946407982;6534.085228068075;6596.175478065242;6656.500762442836;6667.399934005963;6391;6431.6462594556815;6436.485081193493;6443.742250309935;6453.838654033593;6366.427021567988;6600.966995164993;6618.669066546653;6639.302873198245;6658.9001164982565;6249.500039996698;6291.905621415591;6308.71610777507;6332.461740752087;6350.809475715736;6124.173236613178;6235.3452887446165;6250.656213908279;6274.215723034621;6275.497960163268;6582.144321238208;6597.538172327891;6614.173228346457;6623.271440141484;6630.187642105712;4023.637872591481;4090.200311862771;4185.937210941899;4222.205562635929;4227.408162857264;5861.805316102649;5872.941270587239;5886.146508756292;5905.261842269716;5959.255093113361;5661.980843448054;5669.4047125051275;5731.770729170787;5758.539316854558;5764.308283005898;5634.718264086698;5650.886982260414;5670.688112153871;5689.118186681071;5753.194552762533;5600.187972744011;5648.293963254593;5669.716514174357;5685;5685.971570142123;5538.236196470848;5696.743646535833;5750.367459579526;5761.5102716269585;5763.423657634203;5601.80393686219;5618.606697531297;5641.717914104196;5656.915146272891;5667.291588551431 02:33:56 INFO - PROCESS | 6044 | |5;yui.html;685.6160550091946;698.9510734248602;708.2280314457241;774.9147593764685;819.8688209886418;13599.116057456271;13741.106828056169;13819.170849748996;13824.51614193501;13995;12504.49982000719;12536.874631253684;12595.748085038294;12632.93683531581;12653.936730316358;645.6932956845484;737.9520331178483;780.5199802121697;799.6321692021677;801.1587832775591;789.1989630525022;794.5907857453387;795.7135431244748;798.6925033861976;799.6881216325638;840.1220724343076;846.3229416466833;847.5380917400032;849.7365816596844;850.3919697416346;833.9124391938819;841.5203334099566;841.7769291137853;842.9915700842975;846.3144852669358;608.8051823416508;614.3610644929313;614.8094090831856;615.59986009094;616.4575173846986;14046.087004344685;14084.647883802885;14143.717125657533;14154.85845141556;14162.645933851632;13105.279209643466;13270.1374410663;13286.933565332209;13301.201927884262;13332.800007999887;11839.881601183964;11928;12145.757084858342;12154.149209555335;12249.448774805156;4493.3709280700405;4513.187626227278;4516.435445569304;4547.79534920926;4620.006698559792;53057.2041419379;53957.46042539603;54088.45911540913;54496;54700.45299546993;11109.722256943642;11287.774244515227;11394;11425.657230283105;11479.483423245974;19222.80777192238;19341.51646208856;19541.21835126579;19577.119029643414;19619;8387.664493420194;8397.244248017707;8425;8446.915530844613;8452.239298463044;4722.905541889143;4755.976220118877;4773.689710168897;4796.496367881392;4837.395325584302;3081.6302043754895;3141.4031334046913;3153.921151971173;3158.242021914724;3162.667919868427;596.8478038100257;612.9270994243229;618.3074956049164;628.4124343738619;629.7323637454156;575.5625724449449;660.6630618384659;673.8079647300495;677.3632785181914;687.594319351575;8449.254506935344;8487.745367638981;8567.700130495403;8648.956755216184;8756.781080472912;662.9038789375513;662.9370209830058;666.7599664120912;670.8859493886051;688.834679676874;3780.546334439885;4150.584941505826;4162.4279837433405;4190.8533201337805;4253.041603687142;60142.69928650329;62115.06827397593;62782;63387;63424.365756341846;51346;52125.218121728205;52622.47377526252;52980;58878.41121588815;49449.25826112611;50900.49099509032;51082.489175107774;53623.731881341126;53766;8590.871136932827;8714.346424018097;8792.648294068165;8962.283017358726;9004.90995090067;33680.32639347248;34019.65980340264;34122.829385852914;34619.82690086534;34669.65330346664;41823.58176418197;44350;44392;44973.32540011968;45262.32106518339;11468.885311146782;11528.711782205177;11532;11621.825672614748;11778.52885884555;12554.183978041397;12720.816556970169;12843.422046007765;12873.485060597846;13013.349332533524;10769.730756731144;10850.186236032487;10932.836007460053;11098.944505277423;11178.832317515082;12281.44733487013;12344.4444999977;12445.25328480294;12607.747845042864;13103.475860965455;11315.773684526428;11702.180847340946;11733.706657333294;11948.880511194777;12092.818607721067;10495.950404959443;10518.715485776129;10564.260501764802;10646.414447205478;10692.73268168271;10152.593896244067;10262.846057309296;10321.690349289533;10327.277090603586;10390.740231494274 02:33:56 INFO - PROCESS | 6044 | __end_tp_report 02:33:56 INFO - PROCESS | 6044 | __start_cc_report 02:33:56 INFO - PROCESS | 6044 | _x_x_mozilla_cycle_collect,337 02:33:56 INFO - PROCESS | 6044 | __end_cc_report 02:33:56 INFO - PROCESS | 6044 | __startTimestamp1461922436438__endTimestamp 02:33:56 INFO - PROCESS | 6044 | 02:33:56 INFO - PROCESS | 6044 | ------- Summary: start ------- 02:33:56 INFO - PROCESS | 6044 | Number of tests: 6 02:33:56 INFO - PROCESS | 6044 | 02:33:56 INFO - PROCESS | 6044 | [#0] dojo.html Cycles:165 Average:5325.42 Median:5570.22 stddev:696.13 (12.5%) stddev-sans-first:677.03 02:33:56 INFO - PROCESS | 6044 | Values: 3150.1 3204.3 3212.6 3254.9 3264.4 5347.2 5379.2 5387.5 5410.0 5417.0 5281.9 5387.6 5390.7 5489.0 5494.9 4810.7 4867.9 4918.4 4958.2 4978.9 898.3 4771.5 4824.7 4888.8 4958.4 4882.5 4912.6 4922.1 4937.8 4940.3 4851.9 4898.2 4912.9 4938.0 4942.5 4827.4 4856.6 4858.6 4876.1 4895.0 5288.1 5289.8 5297.1 5319.0 5325.1 5534.3 5654.8 5666.4 5687.9 5728.5 5695.6 5709.0 5723.0 5754.5 5786.8 5339.0 5344.2 5349.7 5355.5 5360.3 5665.7 5814.7 5848.9 5867.0 5890.2 5707.5 5713.0 5740.6 5741.4 5749.6 5671.3 5684.3 5686.5 5690.8 5728.3 5701.3 5718.7 5738.2 5747.0 5787.2 5761.1 5762.6 5764.3 5766.9 5802.1 4236.8 4398.6 4408.8 4413.0 4472.6 3815.3 3881.2 3924.3 3930.2 3973.8 5439.9 5488.3 5491.9 5529.8 5570.2 5557.4 5645.2 5686.2 5709.7 5722.3 5548.8 5550.8 5588.6 5600.2 5602.6 4861.8 4864.3 4875.0 4897.0 4932.7 5941.6 6069.6 6071.0 6071.6 6092.1 5750.5 5794.3 5795.0 5825.6 5838.9 6066.6 6101.4 6102.1 6115.4 6119.6 5558.8 5696.8 5706.4 5728.3 5730.1 5806.2 5814.3 5818.0 5829.4 5869.3 5580.1 5620.2 5623.4 5626.1 5637.7 5422.5 5600.5 5641.2 5653.9 5654.8 5477.3 5498.7 5509.6 5516.3 5539.4 5591.5 5606.8 5613.0 5627.3 5651.7 5377.4 5544.7 5565.3 5611.4 5615.3 02:33:56 INFO - PROCESS | 6044 | 02:33:56 INFO - PROCESS | 6044 | [#1] ext.html Cycles:180 Average:55159.92 Median:38627.92 stddev:107490.45 (278.3%) stddev-sans-first:107713.94 02:33:56 INFO - PROCESS | 6044 | Values: 601.6 648.8 649.6 667.6 668.4 36962.8 37833.4 37901.0 37996.4 38007.6 37897.6 38497.2 38585.4 38670.4 38710.2 8460.7 8564.7 8652.3 8658.7 8673.1 8487.0 8790.8 8795.3 8822.6 8840.6 8846.3 8901.0 8902.8 8929.7 8932.6 8812.0 8828.7 8866.2 8870.8 8895.1 8721.8 8835.2 8837.5 8840.2 8855.6 28423.6 38385.4 38751.8 38924.8 39001.0 3329.4 3397.6 3405.4 3445.7 3454.2 30524.0 31001.2 31135.8 31342.0 32448.2 3683.6 3688.4 3694.6 3723.4 3736.2 225702.0 229111.0 229291.0 229633.0 231937.8 60847.0 61291.0 61434.0 61731.4 61887.4 57458.0 58760.4 58775.0 63836.7 64547.4 16777.7 16834.0 16898.5 16992.5 17067.9 13020.2 13058.7 13201.1 13213.9 13247.7 20120.5 20294.3 20380.9 20395.2 20417.7 7820.8 7858.8 7897.6 7955.8 8123.6 972.7 982.7 999.9 1062.9 1130.9 31664.4 31711.5 31917.5 31972.7 32796.2 1031.2 1075.3 1097.6 1105.8 1180.7 16362.8 16411.4 16422.8 16789.0 17109.1 499102.0 506093.0 506584.0 507061.0 508236.0 55853.7 57192.7 57213.7 57272.0 57341.0 1338.5 1371.0 1386.3 1386.4 1479.6 30712.0 31283.5 31465.0 32136.0 32374.5 50143.0 51042.7 51100.5 51211.0 51238.7 420921.0 429463.0 429527.0 430433.0 430947.0 28237.6 28696.4 28766.8 28855.6 28919.4 45699.0 46417.5 46884.5 47766.5 48178.8 39361.2 40225.2 40411.8 40583.4 41581.2 39329.2 39973.6 40654.4 40942.8 41102.2 30988.5 36316.0 37038.6 38578.8 40747.0 33178.8 34177.5 34572.0 34659.1 34703.5 27002.0 27422.7 27444.0 27474.6 27952.7 02:33:56 INFO - PROCESS | 6044 | 02:33:56 INFO - PROCESS | 6044 | [#2] jquery.html Cycles:180 Average:29175.10 Median:3506.53 stddev:73335.28 (2091.4%) stddev-sans-first:73509.17 02:33:56 INFO - PROCESS | 6044 | Values: 396.2 404.9 407.4 411.1 414.6 17936.6 18678.9 18725.6 18777.2 20331.3 19163.8 19385.3 19616.9 20229.3 20300.7 6196.4 6305.2 6368.4 6374.9 6383.8 6136.2 6486.6 6502.6 6550.1 6557.8 6296.2 6322.3 6325.0 6334.3 6351.5 6090.8 6330.8 6348.8 6526.9 6598.9 6320.1 6340.7 6359.1 6370.3 6370.8 24460.9 25868.4 25892.4 26245.3 26984.7 2546.2 2554.4 2641.5 2646.9 2861.4 15423.2 16015.6 16133.4 16348.5 16629.1 2098.1 2136.2 2183.0 2183.3 2244.7 94861.5 95414.0 98677.5 99180.0 99886.0 17180.3 18049.0 18403.0 18527.2 18653.1 32877.8 32993.0 33223.0 33268.5 33301.5 10364.0 10386.7 10452.3 10506.2 10712.7 8911.0 8919.0 8985.0 9060.4 9150.2 8794.4 8841.5 8952.9 9004.7 9169.6 3400.9 3612.2 3632.9 3635.9 3659.9 900.6 923.0 950.0 977.9 1068.7 18062.5 18842.2 19044.4 19261.2 19335.3 931.7 975.2 1004.9 1006.2 1039.2 9916.9 10141.8 10190.9 10194.5 10394.2 361380.0 371303.0 371934.0 520000.0 540231.0 93021.5 99410.5 100128.0 101522.5 101628.0 984.4 992.6 994.8 1029.7 1031.8 17129.4 17259.7 17347.9 17449.6 17562.7 39486.2 39579.4 39753.6 40703.0 40824.2 54607.7 55906.7 56889.4 57826.7 59211.0 8266.5 8531.6 8755.1 8868.9 8911.1 7699.8 11197.5 12148.8 13767.8 14031.9 9624.0 11045.2 11177.9 11242.2 11393.3 11212.9 11795.6 11817.8 11825.6 12015.3 11116.2 11121.8 11194.3 11372.7 11507.1 8338.4 8442.8 8461.1 8493.7 9190.1 8469.1 10345.1 10867.9 10881.1 11023.6 02:33:56 INFO - PROCESS | 6044 | 02:33:56 INFO - PROCESS | 6044 | [#3] mootools.html Cycles:180 Average:5463.56 Median:4898.99 stddev:3037.14 (62.0%) stddev-sans-first:3031.03 02:33:56 INFO - PROCESS | 6044 | Values: 1495.8 1536.2 1636.5 1736.1 1739.9 7293.9 7858.3 8012.6 8110.0 8163.6 8252.0 8272.8 8289.9 8315.5 8326.6 2250.2 2324.9 2325.4 2325.9 2328.8 2330.3 2347.2 2354.9 2356.4 2359.1 2333.1 2352.1 2358.7 2392.2 2397.5 2284.3 2291.4 2301.7 2310.0 2315.3 2237.8 2241.3 2244.3 2248.2 2250.7 8311.0 8369.8 8375.5 8384.9 8410.2 5018.4 5167.8 5178.9 5193.8 5203.3 3037.0 3092.0 3178.4 3191.7 3231.2 997.2 1002.6 1009.1 1014.6 1025.8 10540.5 10588.4 10600.7 10642.4 10678.9 4396.8 4431.3 4520.8 4521.2 4529.1 9304.2 9331.8 9337.8 9343.3 9369.7 5000.0 5009.9 5011.2 5011.9 5028.6 4176.0 4601.1 4604.2 4708.5 4710.2 3976.2 4047.9 4136.1 4178.8 4186.1 1297.6 1329.9 1339.0 1343.6 1345.8 907.1 931.4 932.1 946.9 948.8 5404.1 5600.1 5695.5 5695.8 5746.3 411.2 426.0 429.6 432.9 443.7 3785.2 3843.1 3861.2 3904.9 3932.4 9989.2 10155.4 10501.3 10514.2 10527.4 10372.5 10377.4 10381.6 10418.3 10469.6 7491.0 7824.0 7839.8 7852.4 7903.3 5711.6 5767.5 5859.9 5909.4 5999.6 9633.1 9853.3 9861.0 9863.2 9923.2 9571.2 9692.6 9733.5 9805.8 9923.6 6601.7 7272.2 7405.1 7440.5 7783.3 7696.7 7771.3 7791.4 7803.1 7817.8 6870.3 7089.3 7138.9 7191.0 7225.6 6989.8 7124.8 7161.1 7212.6 7239.6 6315.3 6374.0 6396.7 6402.5 6495.8 4798.6 4834.2 4890.6 4907.4 4970.0 4716.2 4766.8 4769.5 4828.8 4869.4 02:33:56 INFO - PROCESS | 6044 | 02:33:56 INFO - PROCESS | 6044 | [#4] prototype.html Cycles:180 Average:4961.75 Median:5577.75 stddev:1496.57 (26.8%) stddev-sans-first:1459.61 02:33:56 INFO - PROCESS | 6044 | Values: 317.8 330.7 331.8 340.3 341.0 5363.9 5381.6 5402.3 5524.0 5555.3 5366.8 5462.5 5476.2 5477.5 5510.9 4232.6 4252.6 4265.3 4274.6 4279.6 4187.5 4286.8 4295.9 4309.4 4314.2 4186.7 4208.5 4233.6 4261.8 4270.5 4219.2 4221.6 4235.7 4265.5 4269.2 3664.9 3759.5 3768.4 3768.6 3772.2 5297.9 5314.7 5331.3 5333.9 5340.9 4848.7 4857.8 4873.0 4889.8 4893.0 5606.7 5681.5 5716.7 5745.4 5752.1 4110.8 4116.6 4118.3 4135.6 4142.6 5860.2 5919.1 5955.9 5958.4 5983.9 4104.5 4210.5 4222.1 4230.4 4231.8 4289.5 4301.5 4305.5 4305.5 4320.7 4834.6 4835.4 4862.5 4868.7 4885.0 5643.7 5726.8 5743.1 5787.5 5791.3 1571.1 1572.9 1575.5 1583.4 1588.5 1059.7 1064.6 1075.7 1076.2 1091.5 6008.9 6013.5 6033.2 6057.4 6058.2 6308.5 6311.5 6325.8 6354.8 6390.5 5849.3 5939.3 5980.2 6002.0 6046.2 3365.0 3391.5 3391.6 3399.6 3409.8 6507.0 6534.1 6596.2 6656.5 6667.4 6391.0 6431.6 6436.5 6443.7 6453.8 6366.4 6601.0 6618.7 6639.3 6658.9 6249.5 6291.9 6308.7 6332.5 6350.8 6124.2 6235.3 6250.7 6274.2 6275.5 6582.1 6597.5 6614.2 6623.3 6630.2 4023.6 4090.2 4185.9 4222.2 4227.4 5861.8 5872.9 5886.1 5905.3 5959.3 5662.0 5669.4 5731.8 5758.5 5764.3 5634.7 5650.9 5670.7 5689.1 5753.2 5600.2 5648.3 5669.7 5685.0 5686.0 5538.2 5696.7 5750.4 5761.5 5763.4 5601.8 5618.6 5641.7 5656.9 5667.3 02:33:56 INFO - PROCESS | 6044 | 02:33:56 INFO - PROCESS | 6044 | [#5] yui.html Cycles:180 Average:14617.84 Median:4514.81 stddev:17054.59 (377.7%) stddev-sans-first:17070.34 02:33:56 INFO - PROCESS | 6044 | Values: 685.6 699.0 708.2 774.9 819.9 13599.1 13741.1 13819.2 13824.5 13995.0 12504.5 12536.9 12595.7 12632.9 12653.9 645.7 738.0 780.5 799.6 801.2 789.2 794.6 795.7 798.7 799.7 840.1 846.3 847.5 849.7 850.4 833.9 841.5 841.8 843.0 846.3 608.8 614.4 614.8 615.6 616.5 14046.1 14084.6 14143.7 14154.9 14162.6 13105.3 13270.1 13286.9 13301.2 13332.8 11839.9 11928.0 12145.8 12154.1 12249.4 4493.4 4513.2 4516.4 4547.8 4620.0 53057.2 53957.5 54088.5 54496.0 54700.5 11109.7 11287.8 11394.0 11425.7 11479.5 19222.8 19341.5 19541.2 19577.1 19619.0 8387.7 8397.2 8425.0 8446.9 8452.2 4722.9 4756.0 4773.7 4796.5 4837.4 3081.6 3141.4 3153.9 3158.2 3162.7 596.8 612.9 618.3 628.4 629.7 575.6 660.7 673.8 677.4 687.6 8449.3 8487.7 8567.7 8649.0 8756.8 662.9 662.9 666.8 670.9 688.8 3780.5 4150.6 4162.4 4190.9 4253.0 60142.7 62115.1 62782.0 63387.0 63424.4 51346.0 52125.2 52622.5 52980.0 58878.4 49449.3 50900.5 51082.5 53623.7 53766.0 8590.9 8714.3 8792.6 8962.3 9004.9 33680.3 34019.7 34122.8 34619.8 34669.7 41823.6 44350.0 44392.0 44973.3 45262.3 11468.9 11528.7 11532.0 11621.8 11778.5 12554.2 12720.8 12843.4 12873.5 13013.3 10769.7 10850.2 10932.8 11098.9 11178.8 12281.4 12344.4 12445.3 12607.7 13103.5 11315.8 11702.2 11733.7 11948.9 12092.8 10496.0 10518.7 10564.3 10646.4 10692.7 10152.6 10262.8 10321.7 10327.3 10390.7 02:33:56 INFO - PROCESS | 6044 | -------- Summary: end -------- 02:33:56 INFO - PROCESS | 6044 | 02:33:57 INFO - TEST-INFO | 6044: exit 0 02:33:57 INFO - TEST-OK | dromaeo_css | took 1109577ms 02:33:57 INFO - TEST-START | kraken 02:33:57 INFO - operating with platform_type : linux_ 02:33:57 INFO - Initialising browser for kraken test... 02:33:57 INFO - TEST-INFO | started process 6277 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpx4OVcZ/profile http://localhost:53998/getInfo.html) 02:34:00 INFO - PROCESS | 6277 | 02:34:00 INFO - PROCESS | 6277 | (process:6345): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 02:34:01 INFO - PROCESS | 6277 | __metrics Screen width/height:1600/1200 02:34:01 INFO - PROCESS | 6277 | colorDepth:24 02:34:01 INFO - PROCESS | 6277 | Browser inner width/height: 1024/697 02:34:01 INFO - PROCESS | 6277 | __metrics 02:34:02 ERROR - PROCESS | 6277 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 02:34:03 INFO - TEST-INFO | 6277: exit 0 02:34:03 INFO - Browser initialized. 02:34:03 INFO - Running cycle 1/1 for kraken test... 02:34:03 INFO - TEST-INFO | started process 6396 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpx4OVcZ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:34:05 INFO - PROCESS | 6396 | 02:34:05 INFO - PROCESS | 6396 | (process:6458): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 02:34:15 INFO - PROCESS | 6396 | RSS: Main: 164421632 02:34:15 INFO - PROCESS | 6396 | 02:34:17 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:53998/tests/kraken/driver.html?testName=audio-beat-detection) 02:34:18 INFO - PROCESS | 6396 | RSS: Main: 169385984 02:34:18 INFO - PROCESS | 6396 | 02:34:21 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:53998/tests/kraken/driver.html?testName=audio-dft) 02:34:21 INFO - PROCESS | 6396 | RSS: Main: 172789760 02:34:21 INFO - PROCESS | 6396 | 02:34:24 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:53998/tests/kraken/driver.html?testName=audio-fft) 02:34:25 INFO - PROCESS | 6396 | RSS: Main: 163520512 02:34:25 INFO - PROCESS | 6396 | 02:34:27 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:53998/tests/kraken/driver.html?testName=audio-oscillator) 02:34:27 INFO - PROCESS | 6396 | RSS: Main: 163201024 02:34:27 INFO - PROCESS | 6396 | 02:34:30 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:53998/tests/kraken/driver.html?testName=imaging-gaussian-blur) 02:34:30 INFO - PROCESS | 6396 | RSS: Main: 164237312 02:34:30 INFO - PROCESS | 6396 | 02:34:33 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:53998/tests/kraken/driver.html?testName=imaging-darkroom) 02:34:34 INFO - PROCESS | 6396 | RSS: Main: 164958208 02:34:34 INFO - PROCESS | 6396 | 02:34:37 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:53998/tests/kraken/driver.html?testName=imaging-desaturate) 02:34:38 INFO - PROCESS | 6396 | RSS: Main: 165085184 02:34:38 INFO - PROCESS | 6396 | 02:34:41 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:53998/tests/kraken/driver.html?testName=json-parse-financial) 02:34:41 INFO - PROCESS | 6396 | RSS: Main: 167596032 02:34:41 INFO - PROCESS | 6396 | 02:34:43 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:53998/tests/kraken/driver.html?testName=json-stringify-tinderbox) 02:34:44 INFO - PROCESS | 6396 | RSS: Main: 167464960 02:34:44 INFO - PROCESS | 6396 | 02:34:45 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:53998/tests/kraken/driver.html?testName=stanford-crypto-aes) 02:34:46 INFO - PROCESS | 6396 | RSS: Main: 167043072 02:34:46 INFO - PROCESS | 6396 | 02:34:48 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:53998/tests/kraken/driver.html?testName=stanford-crypto-ccm) 02:34:49 INFO - PROCESS | 6396 | RSS: Main: 167383040 02:34:49 INFO - PROCESS | 6396 | 02:34:51 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:53998/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 02:34:52 INFO - PROCESS | 6396 | RSS: Main: 168304640 02:34:52 INFO - PROCESS | 6396 | 02:34:55 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:53998/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 02:34:55 INFO - PROCESS | 6396 | RSS: Main: 168091648 02:34:55 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | Cycle 1(1): loaded http://localhost:53998/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:53998/tests/kraken/driver.html?testName=ai-astar) 02:34:57 INFO - PROCESS | 6396 | RSS: Main: 169861120 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | __start_tp_report 02:34:57 INFO - PROCESS | 6396 | _x_x_mozilla_page_load 02:34:57 INFO - PROCESS | 6396 | _x_x_mozilla_page_load_details 02:34:57 INFO - PROCESS | 6396 | |i|pagename|runs| 02:34:57 INFO - PROCESS | 6396 | |0;ai-astar;112;105;113;112;111;123;110;110;111;111 02:34:57 INFO - PROCESS | 6396 | |1;audio-beat-detection;147;129;152;191;128;166;158;128;186;130 02:34:57 INFO - PROCESS | 6396 | |2;audio-dft;166;163;161;163;162;165;176;162;162;164 02:34:57 INFO - PROCESS | 6396 | |3;audio-fft;76;76;76;139;76;77;73;74;101;75 02:34:57 INFO - PROCESS | 6396 | |4;audio-oscillator;94;93;155;92;93;93;150;94;95;154 02:34:57 INFO - PROCESS | 6396 | |5;imaging-gaussian-blur;117;117;117;118;117;118;117;118;117;117 02:34:57 INFO - PROCESS | 6396 | |6;imaging-darkroom;146;146;146;147;146;147;147;150;145;146 02:34:57 INFO - PROCESS | 6396 | |7;imaging-desaturate;95;96;97;95;95;96;95;95;96;95 02:34:57 INFO - PROCESS | 6396 | |8;json-parse-financial;60;58;58;59;60;58;60;79;58;61 02:34:57 INFO - PROCESS | 6396 | |9;json-stringify-tinderbox;60;60;60;60;60;60;59;60;61;62 02:34:57 INFO - PROCESS | 6396 | |10;stanford-crypto-aes;76;75;77;77;79;77;78;77;77;78 02:34:57 INFO - PROCESS | 6396 | |11;stanford-crypto-ccm;122;126;122;122;132;125;124;125;175;125 02:34:57 INFO - PROCESS | 6396 | |12;stanford-crypto-pbkdf2;176;166;168;176;166;165;178;187;176;170 02:34:57 INFO - PROCESS | 6396 | |13;stanford-crypto-sha256-iterative;71;69;68;68;71;70;69;69;71;68 02:34:57 INFO - PROCESS | 6396 | __end_tp_report 02:34:57 INFO - PROCESS | 6396 | __start_cc_report 02:34:57 INFO - PROCESS | 6396 | _x_x_mozilla_cycle_collect,835 02:34:57 INFO - PROCESS | 6396 | __end_cc_report 02:34:57 INFO - PROCESS | 6396 | __startTimestamp1461922497673__endTimestamp 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | ------- Summary: start ------- 02:34:57 INFO - PROCESS | 6396 | Number of tests: 14 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#0] ai-astar Cycles:10 Average:111.80 Median:111.50 stddev:4.49 (4.0%) stddev-sans-first:4.76 02:34:57 INFO - PROCESS | 6396 | Values: 112.0 105.0 113.0 112.0 111.0 123.0 110.0 110.0 111.0 111.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#1] audio-beat-detection Cycles:10 Average:151.50 Median:155.00 stddev:23.80 (15.4%) stddev-sans-first:25.18 02:34:57 INFO - PROCESS | 6396 | Values: 147.0 129.0 152.0 191.0 128.0 166.0 158.0 128.0 186.0 130.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#2] audio-dft Cycles:10 Average:164.40 Median:163.50 stddev:4.35 (2.7%) stddev-sans-first:4.58 02:34:57 INFO - PROCESS | 6396 | Values: 166.0 163.0 161.0 163.0 162.0 165.0 176.0 162.0 162.0 164.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#3] audio-fft Cycles:10 Average:84.30 Median:76.00 stddev:20.87 (27.5%) stddev-sans-first:21.92 02:34:57 INFO - PROCESS | 6396 | Values: 76.0 76.0 76.0 139.0 76.0 77.0 73.0 74.0 101.0 75.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#4] audio-oscillator Cycles:10 Average:111.30 Median:93.00 stddev:28.81 (31.0%) stddev-sans-first:29.87 02:34:57 INFO - PROCESS | 6396 | Values: 94.0 93.0 155.0 92.0 93.0 93.0 150.0 94.0 95.0 154.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#5] imaging-gaussian-blur Cycles:10 Average:117.30 Median:117.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 02:34:57 INFO - PROCESS | 6396 | Values: 117.0 117.0 117.0 118.0 117.0 118.0 117.0 118.0 117.0 117.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#6] imaging-darkroom Cycles:10 Average:146.60 Median:146.50 stddev:1.35 (0.9%) stddev-sans-first:1.41 02:34:57 INFO - PROCESS | 6396 | Values: 146.0 146.0 146.0 147.0 146.0 147.0 147.0 150.0 145.0 146.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#7] imaging-desaturate Cycles:10 Average:95.50 Median:95.50 stddev:0.71 (0.7%) stddev-sans-first:0.73 02:34:57 INFO - PROCESS | 6396 | Values: 95.0 96.0 97.0 95.0 95.0 96.0 95.0 95.0 96.0 95.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#8] json-parse-financial Cycles:10 Average:61.10 Median:60.00 stddev:6.38 (10.6%) stddev-sans-first:6.76 02:34:57 INFO - PROCESS | 6396 | Values: 60.0 58.0 58.0 59.0 60.0 58.0 60.0 79.0 58.0 61.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#9] json-stringify-tinderbox Cycles:10 Average:60.20 Median:60.00 stddev:0.79 (1.3%) stddev-sans-first:0.83 02:34:57 INFO - PROCESS | 6396 | Values: 60.0 60.0 60.0 60.0 60.0 60.0 59.0 60.0 61.0 62.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#10] stanford-crypto-aes Cycles:10 Average:77.10 Median:77.00 stddev:1.10 (1.4%) stddev-sans-first:1.09 02:34:57 INFO - PROCESS | 6396 | Values: 76.0 75.0 77.0 77.0 79.0 77.0 78.0 77.0 77.0 78.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#11] stanford-crypto-ccm Cycles:10 Average:129.80 Median:125.00 stddev:16.15 (12.9%) stddev-sans-first:16.88 02:34:57 INFO - PROCESS | 6396 | Values: 122.0 126.0 122.0 122.0 132.0 125.0 124.0 125.0 175.0 125.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:172.80 Median:176.00 stddev:7.02 (4.0%) stddev-sans-first:7.35 02:34:57 INFO - PROCESS | 6396 | Values: 176.0 166.0 168.0 176.0 166.0 165.0 178.0 187.0 176.0 170.0 02:34:57 INFO - PROCESS | 6396 | 02:34:57 INFO - PROCESS | 6396 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.40 Median:69.50 stddev:1.26 (1.8%) stddev-sans-first:1.20 02:34:57 INFO - PROCESS | 6396 | Values: 71.0 69.0 68.0 68.0 71.0 70.0 69.0 69.0 71.0 68.0 02:34:57 INFO - PROCESS | 6396 | -------- Summary: end -------- 02:34:57 INFO - PROCESS | 6396 | 02:34:58 INFO - TEST-INFO | 6396: exit 0 02:34:58 INFO - TEST-OK | kraken | took 61559ms 02:34:58 INFO - SUITE-END | took 1171s 02:34:58 INFO - Completed test suite (00:19:31) 02:34:58 INFO - javascript benchmark 02:34:58 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3150.0549835049487, 3204.3270913108245, 3212.566303549023, 3254.9186270343253, 3264.412405766961, 5347.19792031195, 5379.16622923447, 5387.488188622085, 5409.9729501352485, 5417.0, 5281.867953301169, 5387.595930305223, 5390.676559406438, 5489.039418101836, 5494.945050549493, 4810.735409552473, 4867.878303042435, 4918.360613120307, 4958.181899986498, 4978.850634480971, 898.2608736228616, 4771.498992605779, 4824.710517368969, 4888.780004899788, 4958.404991401037, 4882.462929077798, 4912.631552633549, 4922.11401947651, 4937.753112344386, 4940.25896115582, 4851.854444366674, 4898.24077268024, 4912.877178070541, 4938.013442867812, 4942.5304596063315, 4827.444843842968, 4856.635752318555, 4858.611311095139, 4876.146674331978, 4894.975525122387, 5288.0745869472685, 5289.841304760864, 5297.12597421425, 5319.042572336978, 5325.1479763238085, 5534.280543529316, 5654.830355089312, 5666.4050274721385, 5687.943120568824, 5728.541716662657, 5695.572832037614, 5708.971455142698, 5723.027085395493, 5754.482096611283, 5786.768529258825, 5339.012282727708, 5344.198370244494, 5349.679019258857, 5355.518003379676, 5360.3299587551555, 5665.660060396307, 5814.738336774855, 5848.912266316009, 5866.970665146647, 5890.175375447441, 5707.543396528268, 5712.971435142797, 5740.6268592541355, 5741.368449470555, 5749.568782341341, 5671.262735844314, 5684.317881854121, 5686.545076393879, 5690.800821971294, 5728.255326807572, 5701.287339082614, 5718.742656580381, 5738.167965644958, 5746.9712651436475, 5787.2187254720075, 5761.078227483583, 5762.596618236683, 5764.308283006066, 5766.876683171552, 5802.1296805479515, 4236.809343579484, 4398.626116780046, 4408.801603927831, 4412.977935110304, 4472.575105364985, 3815.3323168445413, 3881.184951160288, 3924.3328634132267, 3930.194310166409, 3973.7814420207164, 5439.945600543944, 5488.313960754906, 5491.917621235684, 5529.751161197756, 5570.220169176318, 5557.444255574491, 5645.2096706461125, 5686.232358631614, 5709.657420554697, 5722.313322401338, 5548.833534993957, 5550.833474995757, 5588.636738612058, 5600.243967064394, 5602.635828671123, 4861.829835955725, 4864.318995340655, 4874.975625121851, 4896.975515122402, 4932.7286999215385, 5941.55438342126, 6069.575129740876, 6070.969645151746, 6071.574989750675, 6092.086187071975, 5750.539956803445, 5794.275715535558, 5795.043817770021, 5825.563082768725, 5838.94161058384, 6066.575339726177, 6101.420365065312, 6102.084687296763, 6115.388461153849, 6119.632822030692, 5558.777648893999, 5696.829095127153, 5706.400827913009, 5728.312602487728, 5730.054541000688, 5806.187133801355, 5814.30228372598, 5817.981853175762, 5829.38791426911, 5869.325027621878, 5580.051391263414, 5620.241267429008, 5623.353314368736, 5626.099824028136, 5637.661740295595, 5422.457754224546, 5600.523955463831, 5641.210230567806, 5653.943460565341, 5654.802081927113, 5477.260569823182, 5498.725063746717, 5509.586780991362, 5516.282883225315, 5539.362973258127, 5591.4688104629995, 5606.775728970795, 5613.045782216951, 5627.324721033502, 5651.689157096399, 5377.435369286169, 5544.7227638617105, 5565.30433695788, 5611.354694210218, 5615.326160860723], "value": 5280.896527681107, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [601.5548494114354, 648.7696867611995, 649.5680372552252, 667.649484020889, 668.4485299627809, 36962.81518592407, 37833.43249851251, 37901.0, 37996.430053549186, 38007.619923800754, 37897.621023789754, 38497.230055398875, 38585.421218681746, 38670.4199437008, 38710.225795484075, 8460.746177614667, 8564.74305770828, 8652.307815374756, 8658.740237792876, 8673.089325620782, 8486.981562212542, 8790.780230494225, 8795.296376289882, 8822.602982865787, 8840.646374145026, 8846.292296616288, 8900.955495222515, 8902.777430564223, 8929.70519274708, 8932.553372331358, 8812.0, 8828.735137945872, 8866.157715017063, 8870.778230544256, 8895.066018068106, 8721.825563488695, 8835.249003834617, 8837.513936733541, 8840.248578870804, 8855.64577416909, 28423.57364639532, 38385.42421863674, 38751.80624096862, 38924.80537597322, 39001.0, 3329.3674201901563, 3397.6092749333898, 3405.3700065487715, 3445.689887910075, 3454.1709989602314, 30524.0, 31001.224969375722, 31135.844320778477, 31342.0, 32448.18879528007, 3683.557973043225, 3688.409854423306, 3694.5751238607636, 3723.385641369171, 3736.178040831013, 225702.0, 229111.0, 229291.0, 229633.0, 231937.84031079905, 60847.0, 61291.0, 61434.0, 61731.38268617346, 61887.381126188164, 57458.0, 58760.41239587635, 58775.0, 63836.68081659655, 64547.35452645507, 16777.664446711242, 16834.0, 16898.493045208663, 16992.490225293262, 17067.914660426617, 13020.218786872818, 13058.738825223632, 13201.141925774795, 13213.867861321456, 13247.73504529904, 20120.496987575134, 20294.289699860434, 20380.898095509427, 20395.18419263213, 20417.69373459399, 7820.810173151527, 7858.803529911684, 7897.565633890076, 7955.7613271600785, 8123.634436450374, 972.6741541583507, 982.6904525074578, 999.9200863068014, 1062.9415382153902, 1130.9038731707897, 31664.36671266562, 31711.52432713511, 31917.52123718146, 31972.680273197435, 32796.1800954978, 1031.1647565471842, 1075.2634445404922, 1097.5554900265406, 1105.7512059786484, 1180.6694125644833, 16362.83637163637, 16411.42560010394, 16422.81785293126, 16789.0, 17109.14454277306, 499102.0, 506093.0, 506584.0, 507061.0, 508236.0, 55853.72073139608, 57192.714036430385, 57213.71393143007, 57272.0, 57341.0, 1338.5114433231995, 1370.9931450342883, 1386.272207091285, 1386.4454218312553, 1479.5931118942162, 30712.0, 31283.53074703927, 31465.0, 32136.0, 32374.514382283814, 50143.0, 51042.744786275834, 51100.488995109576, 51211.0, 51238.74380628073, 420921.0, 429463.0, 429527.0, 430433.0, 430947.0, 28237.57643635306, 28696.426071478036, 28766.849326026724, 28855.56716649294, 28919.421611568072, 45699.0, 46417.53582464132, 46884.53115468802, 47766.52233477621, 48178.75910620424, 39361.21277574375, 40225.1954960905, 40411.7979410101, 40583.39124913188, 41581.16837663169, 39329.213415730956, 39973.60026399815, 40654.39018414667, 40942.79528602338, 41102.17795644011, 30988.535171971987, 36316.0, 37038.62961370352, 38578.80710596429, 40747.0, 33178.834105829315, 34177.487337689454, 34572.0, 34659.13352166216, 34703.47944780881, 27002.0, 27422.725772742815, 27444.0, 27474.5878811814, 27952.720472795012], "value": 19501.892254535887, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [396.2491079404527, 404.93116170251056, 407.4316328721434, 411.0504734064312, 414.57506056292294, 17936.641267174666, 18678.90660546697, 18725.62548749026, 18777.15502802374, 20331.28840490583, 19163.808361916377, 19385.321513746985, 19616.901915490438, 20229.291974780885, 20300.695489567668, 6196.4113409226275, 6305.2433707955, 6368.426841584256, 6374.936250637504, 6383.840403989891, 6136.171616831737, 6486.61080335179, 6502.577332473374, 6550.148480697502, 6557.836054098638, 6296.150019747344, 6322.336154703736, 6325.019621958604, 6334.3032266450655, 6351.460125889282, 6090.756369745205, 6330.778422755205, 6348.777792777254, 6526.869462610721, 6598.868022639568, 6320.115183874262, 6340.746370145189, 6359.141515895341, 6370.267419246753, 6370.77702280418, 24460.877695611587, 25868.35329116787, 25892.35269118268, 26245.343866403302, 26984.73015269842, 2546.172493939477, 2554.361409647588, 2641.4981153580757, 2646.941223510592, 2861.3561948561614, 15423.228838558027, 16015.599610009727, 16133.435329763402, 16348.509544713677, 16629.085400302978, 2098.1397626972866, 2136.220279597951, 2182.9630925310353, 2183.290430610058, 2244.7418546867157, 94861.5256923711, 95414.0, 98677.5066124672, 99180.0081999178, 99886.0, 17180.312787488612, 18049.007304598374, 18403.0, 18527.166277517543, 18653.067346632615, 32877.83561082179, 32993.0, 33223.0, 33268.50097248543, 33301.50047749286, 10364.0, 10386.740331491774, 10452.268341216042, 10506.159507239403, 10712.73218169552, 8910.955445222733, 8918.97668361597, 8985.0, 9060.411073280216, 9150.222231110298, 8794.42836215644, 8841.513716745512, 8952.8657070144, 9004.684836030707, 9169.587368568296, 3400.880969166067, 3612.169201083713, 3632.891013269606, 3635.8547057676747, 3659.853605855736, 900.5542256582902, 922.9861552076724, 950.0357137505438, 977.8582105594649, 1068.7061058209056, 18062.458126256235, 18842.152103155116, 19044.428667140008, 19261.22955081809, 19335.323263685987, 931.7111695374456, 975.22956864078, 1004.9346792458467, 1006.2352612014921, 1039.2413538117066, 9916.900830991597, 10141.847872281922, 10190.949045254874, 10194.541245643964, 10394.22043346752, 361380.0, 371303.0, 371934.0, 520000.0, 540231.0, 93021.53489232645, 99410.5029474848, 100128.0, 101522.49238753758, 101628.0, 984.4487087231173, 992.6277645882794, 994.8159590475785, 1029.711680729382, 1031.7884833609091, 17129.400470983954, 17259.654806904044, 17347.913260433616, 17449.56376090608, 17562.71684680983, 39486.210275794896, 39579.406308904814, 39753.602463976145, 40703.0, 40824.183516328914, 54607.72696136494, 55906.720466397404, 56889.43110568841, 57826.71086644708, 59211.0, 8266.545340006358, 8531.573421328785, 8755.124487551195, 8868.86696699537, 8911.06433824439, 7699.807504812425, 11197.488339074447, 12148.817767733315, 13767.793483097961, 14031.929840351142, 9623.951880240835, 11045.226834121535, 11177.88822111801, 11242.156838237, 11393.259438136494, 11212.943935280271, 11795.587154449553, 11817.763644727229, 11825.645230643095, 12015.339156346485, 11116.166287528305, 11121.777564448828, 11194.328340299608, 11372.715682108013, 11507.136964727846, 8338.37462190326, 8442.831143377221, 8461.06928237881, 8493.745187644381, 9190.080991900757, 8469.110743372104, 10345.120664743581, 10867.891321086689, 10881.129509639051, 11023.559057637925], "value": 10288.33242415741, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1495.760678291473, 1536.162791278753, 1636.509047285814, 1736.1145815634022, 1739.90430526321, 7293.854122917539, 7858.332041776449, 8012.599370031504, 8109.9594502027485, 8163.551004694739, 8252.0, 8272.75181744547, 8289.91710082899, 8315.459495132813, 8326.625301861415, 2250.2011785816003, 2324.93025209244, 2325.4070212095976, 2325.883705814711, 2328.836981411302, 2330.312557795446, 2347.248880358286, 2354.8704821234824, 2356.434455730621, 2359.138914296278, 2333.125078095714, 2352.0591763294647, 2358.716953965518, 2392.1866565367773, 2397.5324811661735, 2284.3375421127853, 2291.4385975436044, 2301.7122859642545, 2310.0182422470466, 2315.3169814904645, 2237.7762223777654, 2241.2939923923914, 2244.3267019893965, 2248.201888329636, 2250.6961560189493, 8310.958445207736, 8369.83260334796, 8375.45559538628, 8384.8742268866, 8410.201030902055, 5018.447970723218, 5167.767450464738, 5178.922316165261, 5193.844184674428, 5203.271541984125, 3036.9544456833164, 3091.9536206956914, 3178.3643271345823, 3191.7127458528844, 3231.1922019495128, 997.1922742578535, 1002.5939494504664, 1009.0514915978956, 1014.5586669798661, 1025.8307379282485, 10540.525676344583, 10588.364698118137, 10600.734981625521, 10642.414667193301, 10678.893211067867, 4396.846110386121, 4431.313146462304, 4520.796564154621, 4521.163584736834, 4529.139463501924, 9304.209142222986, 9331.766705832273, 9337.766555836159, 9343.345965782466, 9369.672061477952, 4999.975000125049, 5009.924851127236, 5011.223260394645, 5011.874703132378, 5028.572571331478, 4176.0395109125075, 4601.125786100697, 4604.194266003436, 4708.4820669726305, 4710.24636058229, 3976.224636195972, 4047.9392809107885, 4136.110736191733, 4178.770167640809, 4186.058136919169, 1297.5847728726717, 1329.8537160912292, 1338.9933050334687, 1343.6237853401062, 1345.7779466387935, 907.0974380491322, 931.3527098666361, 932.1238036245907, 946.9195118414874, 948.848184290524, 5404.054290499147, 5600.0759874620235, 5695.487406133385, 5695.772169113189, 5746.310442746897, 411.24125987553515, 425.99787001064794, 429.57472102618806, 432.86148432501295, 443.66281625963853, 3785.246425433381, 3843.135294558702, 3861.1505468796818, 3904.941425878614, 3932.4297976793205, 9989.200863930868, 10155.39067655943, 10501.264911456277, 10514.21143414247, 10527.420991845522, 10372.533236004398, 10377.429241391796, 10381.636642717469, 10418.270721049454, 10469.633562825264, 7490.962545187239, 7824.0, 7839.804004899923, 7852.411069169835, 7903.2887040165515, 5711.600187986801, 5767.509761670137, 5859.94140058594, 5909.438603332676, 5999.5500337473995, 9633.133018028411, 9853.261005424478, 9860.950695246765, 9863.161631261137, 9923.206143508358, 9571.234301256021, 9692.563834627317, 9733.513324333897, 9805.754856128653, 9923.553440095357, 6601.669916504252, 7272.23641517633, 7405.148407933157, 7440.479166458513, 7783.299503044753, 7696.653650585849, 7771.300582947561, 7791.415643826849, 7803.102643196105, 7817.843643127219, 6870.3473170048765, 7089.255628158969, 7138.928610713826, 7190.96404517974, 7225.5664660120565, 6989.790306290616, 7124.750633727795, 7161.140663120459, 7212.639368031682, 7239.601821899846, 6315.336889626523, 6374.043893415839, 6396.680165991589, 6402.455791257609, 6495.772647957298, 4798.640101992434, 4834.226523756182, 4890.55984961341, 4907.4111106666, 4969.981153863521, 4716.221823399101, 4766.833160839354, 4769.451513076041, 4828.758562071953, 4869.391326084239], "value": 4347.508431348014, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [317.79661016949143, 330.6544660829433, 331.75118661004245, 340.3023801207524, 341.03827207275486, 5363.9080758504215, 5381.5963802714805, 5402.270693456382, 5523.978064058147, 5555.305631782305, 5366.812161574346, 5462.508374246317, 5476.151196564539, 5477.534409575181, 5510.862228444291, 4232.555581663927, 4252.617264446199, 4265.296226122686, 4274.615284624383, 4279.593438623326, 4187.51843537994, 4286.807093680792, 4295.871123866274, 4309.37514060461, 4314.158739045887, 4186.74879507229, 4208.473940757405, 4233.576642335757, 4261.808218630169, 4270.530241673413, 4219.2405367033925, 4221.577842215769, 4235.682323825726, 4265.50946641134, 4269.188854117708, 3664.8900532984053, 3759.5112635357227, 3768.4158955361963, 3768.566614839301, 3772.1889793694486, 5297.867553311159, 5314.73426328682, 5331.306930099101, 5333.946660533384, 5340.85171688085, 4848.739327774769, 4857.8299759508245, 4872.9512704873205, 4889.801998510352, 4892.9755351223375, 5606.719664016824, 5681.545476361923, 5716.685162412668, 5745.396733342981, 5752.137179423078, 4110.77390743512, 4116.629503344683, 4118.258713431581, 4135.56576559463, 4142.565030671796, 5860.238169037998, 5919.070060320126, 5955.940440595626, 5958.433948774859, 5983.850403739898, 4104.4664193654635, 4210.45264115663, 4222.092250166229, 4230.407742915994, 4231.830726770895, 4289.549597292302, 4301.483821941387, 4305.461817272841, 4305.504866940342, 4320.740755554677, 4834.564889159922, 4835.397628766521, 4862.489438608965, 4868.707877527359, 4885.0, 5643.689597072118, 5726.77092916287, 5743.0811070228565, 5787.536997040227, 5791.333996590446, 1571.1358752686206, 1572.8741700664148, 1575.535217110955, 1583.3666533386738, 1588.5313832419463, 1059.7244716373643, 1064.590132798878, 1075.671920064388, 1076.1767248055244, 1091.4870011094772, 6008.909866352008, 6013.548983826143, 6033.185519954838, 6057.3639767824625, 6058.242719660043, 6308.495320374359, 6311.463525600376, 6325.778597749057, 6354.809355719336, 6390.488760899117, 5849.268841394825, 5939.2575928009, 5980.192673989043, 6001.969990150022, 6046.244219472566, 3364.966350336514, 3391.4573668212965, 3391.593008838955, 3399.558057452515, 3409.7954122752712, 6507.023946407982, 6534.085228068075, 6596.175478065242, 6656.500762442836, 6667.399934005963, 6391.0, 6431.6462594556815, 6436.485081193493, 6443.742250309935, 6453.838654033593, 6366.427021567988, 6600.966995164993, 6618.669066546653, 6639.302873198245, 6658.9001164982565, 6249.500039996698, 6291.905621415591, 6308.71610777507, 6332.461740752087, 6350.809475715736, 6124.173236613178, 6235.3452887446165, 6250.656213908279, 6274.215723034621, 6275.497960163268, 6582.144321238208, 6597.538172327891, 6614.173228346457, 6623.271440141484, 6630.187642105712, 4023.637872591481, 4090.200311862771, 4185.937210941899, 4222.205562635929, 4227.408162857264, 5861.805316102649, 5872.941270587239, 5886.146508756292, 5905.261842269716, 5959.255093113361, 5661.980843448054, 5669.4047125051275, 5731.770729170787, 5758.539316854558, 5764.308283005898, 5634.718264086698, 5650.886982260414, 5670.688112153871, 5689.118186681071, 5753.194552762533, 5600.187972744011, 5648.293963254593, 5669.716514174357, 5685.0, 5685.971570142123, 5538.236196470848, 5696.743646535833, 5750.367459579526, 5761.5102716269585, 5763.423657634203, 5601.80393686219, 5618.606697531297, 5641.717914104196, 5656.915146272891, 5667.291588551431], "value": 4490.618748693689, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [685.6160550091946, 698.9510734248602, 708.2280314457241, 774.9147593764685, 819.8688209886418, 13599.116057456271, 13741.106828056169, 13819.170849748996, 13824.51614193501, 13995.0, 12504.49982000719, 12536.874631253684, 12595.748085038294, 12632.93683531581, 12653.936730316358, 645.6932956845484, 737.9520331178483, 780.5199802121697, 799.6321692021677, 801.1587832775591, 789.1989630525022, 794.5907857453387, 795.7135431244748, 798.6925033861976, 799.6881216325638, 840.1220724343076, 846.3229416466833, 847.5380917400032, 849.7365816596844, 850.3919697416346, 833.9124391938819, 841.5203334099566, 841.7769291137853, 842.9915700842975, 846.3144852669358, 608.8051823416508, 614.3610644929313, 614.8094090831856, 615.59986009094, 616.4575173846986, 14046.087004344685, 14084.647883802885, 14143.717125657533, 14154.85845141556, 14162.645933851632, 13105.279209643466, 13270.1374410663, 13286.933565332209, 13301.201927884262, 13332.800007999887, 11839.881601183964, 11928.0, 12145.757084858342, 12154.149209555335, 12249.448774805156, 4493.3709280700405, 4513.187626227278, 4516.435445569304, 4547.79534920926, 4620.006698559792, 53057.2041419379, 53957.46042539603, 54088.45911540913, 54496.0, 54700.45299546993, 11109.722256943642, 11287.774244515227, 11394.0, 11425.657230283105, 11479.483423245974, 19222.80777192238, 19341.51646208856, 19541.21835126579, 19577.119029643414, 19619.0, 8387.664493420194, 8397.244248017707, 8425.0, 8446.915530844613, 8452.239298463044, 4722.905541889143, 4755.976220118877, 4773.689710168897, 4796.496367881392, 4837.395325584302, 3081.6302043754895, 3141.4031334046913, 3153.921151971173, 3158.242021914724, 3162.667919868427, 596.8478038100257, 612.9270994243229, 618.3074956049164, 628.4124343738619, 629.7323637454156, 575.5625724449449, 660.6630618384659, 673.8079647300495, 677.3632785181914, 687.594319351575, 8449.254506935344, 8487.745367638981, 8567.700130495403, 8648.956755216184, 8756.781080472912, 662.9038789375513, 662.9370209830058, 666.7599664120912, 670.8859493886051, 688.834679676874, 3780.546334439885, 4150.584941505826, 4162.4279837433405, 4190.8533201337805, 4253.041603687142, 60142.69928650329, 62115.06827397593, 62782.0, 63387.0, 63424.365756341846, 51346.0, 52125.218121728205, 52622.47377526252, 52980.0, 58878.41121588815, 49449.25826112611, 50900.49099509032, 51082.489175107774, 53623.731881341126, 53766.0, 8590.871136932827, 8714.346424018097, 8792.648294068165, 8962.283017358726, 9004.90995090067, 33680.32639347248, 34019.65980340264, 34122.829385852914, 34619.82690086534, 34669.65330346664, 41823.58176418197, 44350.0, 44392.0, 44973.32540011968, 45262.32106518339, 11468.885311146782, 11528.711782205177, 11532.0, 11621.825672614748, 11778.52885884555, 12554.183978041397, 12720.816556970169, 12843.422046007765, 12873.485060597846, 13013.349332533524, 10769.730756731144, 10850.186236032487, 10932.836007460053, 11098.944505277423, 11178.832317515082, 12281.44733487013, 12344.4444999977, 12445.25328480294, 12607.747845042864, 13103.475860965455, 11315.773684526428, 11702.180847340946, 11733.706657333294, 11948.880511194777, 12092.818607721067, 10495.950404959443, 10518.715485776129, 10564.260501764802, 10646.414447205478, 10692.73268168271, 10152.593896244067, 10262.846057309296, 10321.690349289533, 10327.277090603586, 10390.740231494274], "value": 6589.652558257112, "unit": "score"}], "name": "dromaeo_css", "value": 7174.044872617096, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 105.0, 113.0, 112.0, 111.0, 123.0, 110.0, 110.0, 111.0, 111.0], "value": 111.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 129.0, 152.0, 191.0, 128.0, 166.0, 158.0, 128.0, 186.0, 130.0], "value": 151.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 163.0, 161.0, 163.0, 162.0, 165.0, 176.0, 162.0, 162.0, 164.0], "value": 164.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 76.0, 139.0, 76.0, 77.0, 73.0, 74.0, 101.0, 75.0], "value": 84.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 93.0, 155.0, 92.0, 93.0, 93.0, 150.0, 94.0, 95.0, 154.0], "value": 111.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 118.0, 117.0, 118.0, 117.0, 118.0, 117.0, 117.0], "value": 117.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 146.0, 147.0, 146.0, 147.0, 147.0, 150.0, 145.0, 146.0], "value": 146.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 97.0, 95.0, 95.0, 96.0, 95.0, 95.0, 96.0, 95.0], "value": 95.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 58.0, 58.0, 59.0, 60.0, 58.0, 60.0, 79.0, 58.0, 61.0], "value": 61.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 60.0, 60.0, 60.0, 60.0, 60.0, 59.0, 60.0, 61.0, 62.0], "value": 60.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 77.0, 77.0, 79.0, 77.0, 78.0, 77.0, 77.0, 78.0], "value": 77.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [122.0, 126.0, 122.0, 122.0, 132.0, 125.0, 124.0, 125.0, 175.0, 125.0], "value": 129.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [176.0, 166.0, 168.0, 176.0, 166.0, 165.0, 178.0, 187.0, 176.0, 170.0], "value": 172.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 69.0, 68.0, 68.0, 71.0, 70.0, 69.0, 69.0, 71.0, 68.0], "value": 69.4, "unit": "score"}], "name": "kraken", "value": 1553.1, "alertThreshold": 2.0}]} 02:34:58 INFO - Return code: 0 02:34:58 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 02:34:58 ERROR - # TBPL SUCCESS # 02:34:58 INFO - Running post-action listener: _resource_record_post_action 02:34:58 INFO - Running post-run listener: _resource_record_post_run 02:35:00 INFO - Total resource usage - Wall time: 1189s; CPU: 13.0%; Read bytes: 8192; Write bytes: 546250752; Read time: 420; Write time: 527900 02:35:00 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 4096; Write bytes: 254791680; Read time: 252; Write time: 344208 02:35:00 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 4096; Write bytes: 291459072; Read time: 168; Write time: 183692 02:35:00 INFO - Running post-run listener: _upload_blobber_files 02:35:00 INFO - Blob upload gear active. 02:35:00 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 02:35:00 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 02:35:00 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', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 02:35:00 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 Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 02:35:00 INFO - (blobuploader) - INFO - Open directory for files ... 02:35:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 02:35:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:35:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:35:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 02:35:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:35:01 INFO - (blobuploader) - INFO - Done attempting. 02:35:01 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 02:35:01 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:35:01 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:35:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 02:35:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:35:01 INFO - (blobuploader) - INFO - Done attempting. 02:35:01 INFO - (blobuploader) - INFO - Iteration through files over. 02:35:01 INFO - Return code: 0 02:35:01 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 02:35:01 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 02:35:01 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/70722710ad361cc740cf7842b9ae18f346801834fb55dee804adfc9ef239152e0c66ae93ccc69978ef848a6bcc0b3f760d5ef3355bf882818226fa8f5c24a2a4", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3a9395b3c49181abbdfa71cba8808510343e52930d92d70d925f256c9072f3c45a5d82dfd11146fd72240107ca0587b3b236877df8164936a2bb0fb8fd9990d3"} 02:35:01 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 02:35:01 INFO - Writing to file /builds/slave/test/properties/blobber_files 02:35:01 INFO - Contents: 02:35:01 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/70722710ad361cc740cf7842b9ae18f346801834fb55dee804adfc9ef239152e0c66ae93ccc69978ef848a6bcc0b3f760d5ef3355bf882818226fa8f5c24a2a4", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3a9395b3c49181abbdfa71cba8808510343e52930d92d70d925f256c9072f3c45a5d82dfd11146fd72240107ca0587b3b236877df8164936a2bb0fb8fd9990d3"} 02:35:01 INFO - Running post-run listener: copy_logs_to_upload_dir 02:35:01 INFO - Copying logs to upload dir... 02:35:01 INFO - mkdir: /builds/slave/test/build/upload/logs 02:35:01 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1228.322282 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 28 secs) (at 2016-04-29 02:35:01.995186) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-29 02:35:01.998497) ========= 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=cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691 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/Fx-Team/sha512/70722710ad361cc740cf7842b9ae18f346801834fb55dee804adfc9ef239152e0c66ae93ccc69978ef848a6bcc0b3f760d5ef3355bf882818226fa8f5c24a2a4", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3a9395b3c49181abbdfa71cba8808510343e52930d92d70d925f256c9072f3c45a5d82dfd11146fd72240107ca0587b3b236877df8164936a2bb0fb8fd9990d3"} build_url:https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011108 build_url: 'https://queue.taskcluster.net/v1/task/ADV3nDuxSjqsQL18Yw52mw/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/70722710ad361cc740cf7842b9ae18f346801834fb55dee804adfc9ef239152e0c66ae93ccc69978ef848a6bcc0b3f760d5ef3355bf882818226fa8f5c24a2a4", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/3a9395b3c49181abbdfa71cba8808510343e52930d92d70d925f256c9072f3c45a5d82dfd11146fd72240107ca0587b3b236877df8164936a2bb0fb8fd9990d3"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-29 02:35:02.025941) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 02:35:02.026519) ========= 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=cbe409c6de289db6ac707de3000001d4-1461920527.699556-1342892691 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004732 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 02:35:02.108167) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-29 02:35:02.108550) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-29 02:35:02.108857) ========= ========= Total master_lag: 0.18 =========