builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-061 starttime: 1456527918.22 results: success (0) buildid: 20160226135901 builduid: 6049e0788a154550bf11fc2c5297d0e8 revision: 0df0a7abe8a5bc93b36ec4065bde09f65257db59 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.222766) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.223227) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.223524) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] 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=516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006564 basedir: '/builds/slave/test' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.242181) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.242500) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.250314) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.250707) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', '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=516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004116 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.298993) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.302338) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.302740) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.303024) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-26 15:05:18-- 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% 43.0M=0s 2016-02-26 15:05:19 (43.0 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.179641 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.494936) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.495262) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] 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=516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020140 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.544959) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:18.545741) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 0df0a7abe8a5bc93b36ec4065bde09f65257db59 --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 0df0a7abe8a5bc93b36ec4065bde09f65257db59 --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=516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-26 15:05:19,117 truncating revision to first 12 chars 2016-02-26 15:05:19,117 Setting DEBUG logging. 2016-02-26 15:05:19,117 attempt 1/10 2016-02-26 15:05:19,117 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/0df0a7abe8a5?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-26 15:05:19,527 unpacking tar archive at: fx-team-0df0a7abe8a5/testing/mozharness/ program finished with exit code 0 elapsedTime=0.738205 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:19.298421) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:19.298913) ========= echo 0df0a7abe8a5bc93b36ec4065bde09f65257db59 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'0df0a7abe8a5bc93b36ec4065bde09f65257db59'] 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=516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 0df0a7abe8a5bc93b36ec4065bde09f65257db59 program finished with exit code 0 elapsedTime=0.003753 script_repo_revision: '0df0a7abe8a5bc93b36ec4065bde09f65257db59' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:19.348087) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:19.348404) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-26 15:05:19.358089) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2016-02-26 15:05:19.358460) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 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-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] 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=516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 15:05:20 INFO - MultiFileLogger online at 20160226 15:05:20 in /builds/slave/test 15:05:20 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 15:05:20 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:05:20 INFO - {'append_to_log': False, 15:05:20 INFO - 'base_work_dir': '/builds/slave/test', 15:05:20 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 15:05:20 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:05:20 INFO - 'branch': 'Fx-Team-Non-PGO', 15:05:20 INFO - 'buildbot_json_path': 'buildprops.json', 15:05:20 INFO - 'config_files': ('talos/linux_config.py',), 15:05:20 INFO - 'default_actions': ('clobber', 15:05:20 INFO - 'read-buildbot-config', 15:05:20 INFO - 'download-and-extract', 15:05:20 INFO - 'populate-webroot', 15:05:20 INFO - 'create-virtualenv', 15:05:20 INFO - 'install', 15:05:20 INFO - 'run-tests'), 15:05:20 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:05:20 INFO - 'download_minidump_stackwalk': True, 15:05:20 INFO - 'download_symbols': 'ondemand', 15:05:20 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:05:20 INFO - 'tooltool.py': '/tools/tooltool.py', 15:05:20 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:05:20 INFO - '/tools/misc-python/virtualenv.py')}, 15:05:20 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:05:20 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:05:20 INFO - 'installer_path': 'installer.exe', 15:05:20 INFO - 'log_level': 'info', 15:05:20 INFO - 'log_name': 'talos', 15:05:20 INFO - 'log_to_console': True, 15:05:20 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 15:05:20 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 15:05:20 INFO - 'opt_config_files': (), 15:05:20 INFO - 'pip_index': False, 15:05:20 INFO - 'sps_profile': False, 15:05:20 INFO - 'sps_profile_interval': 0, 15:05:20 INFO - 'suite': 'dromaeojs-e10s', 15:05:20 INFO - 'system_bits': '32', 15:05:20 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:05:20 INFO - 'title': 'talos-linux64-ix-061', 15:05:20 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:05:20 INFO - 'use_talos_json': True, 15:05:20 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:05:20 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:05:20 INFO - 'work_dir': 'build'} 15:05:20 INFO - ##### 15:05:20 INFO - ##### Running clobber step. 15:05:20 INFO - ##### 15:05:20 INFO - Running pre-action listener: _resource_record_pre_action 15:05:20 INFO - Running main action method: clobber 15:05:20 INFO - rmtree: /builds/slave/test/build 15:05:20 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:05:20 INFO - Running post-action listener: _resource_record_post_action 15:05:20 INFO - ##### 15:05:20 INFO - ##### Running read-buildbot-config step. 15:05:20 INFO - ##### 15:05:20 INFO - Running pre-action listener: _resource_record_pre_action 15:05:20 INFO - Running main action method: read_buildbot_config 15:05:20 INFO - Using buildbot properties: 15:05:20 INFO - { 15:05:20 INFO - "project": "", 15:05:20 INFO - "product": "firefox", 15:05:20 INFO - "script_repo_revision": "production", 15:05:20 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 15:05:20 INFO - "repository": "", 15:05:20 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 15:05:20 INFO - "buildid": "20160226135901", 15:05:20 INFO - "pgo_build": "False", 15:05:20 INFO - "basedir": "/builds/slave/test", 15:05:20 INFO - "buildnumber": 906, 15:05:20 INFO - "slavename": "talos-linux64-ix-061", 15:05:20 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 15:05:20 INFO - "platform": "ubuntu64_hw", 15:05:20 INFO - "scheduler": "tests-fx-team-linux64-talos", 15:05:20 INFO - "branch": "fx-team", 15:05:20 INFO - "repo_path": "integration/fx-team", 15:05:20 INFO - "revision": "0df0a7abe8a5bc93b36ec4065bde09f65257db59", 15:05:20 INFO - "stage_platform": "linux64", 15:05:20 INFO - "builduid": "6049e0788a154550bf11fc2c5297d0e8", 15:05:20 INFO - "slavebuilddir": "test" 15:05:20 INFO - } 15:05:20 INFO - Found installer url https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 15:05:20 INFO - Running post-action listener: _resource_record_post_action 15:05:20 INFO - ##### 15:05:20 INFO - ##### Running download-and-extract step. 15:05:20 INFO - ##### 15:05:20 INFO - Running pre-action listener: _resource_record_pre_action 15:05:20 INFO - Running main action method: download_and_extract 15:05:20 INFO - mkdir: /builds/slave/test/build/tests 15:05:20 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')]} 15:05:20 INFO - https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 15:05:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/test_packages.json 15:05:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/test_packages.json 15:05:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 15:05:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 15:05:21 INFO - Downloaded 1448 bytes. 15:05:21 INFO - Reading from file /builds/slave/test/build/test_packages.json 15:05:21 INFO - Using the following test package requirements: 15:05:21 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 15:05:21 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 15:05:21 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 15:05:21 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 15:05:21 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 15:05:21 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 15:05:21 INFO - u'jsshell-linux-x86_64.zip'], 15:05:21 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 15:05:21 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 15:05:21 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 15:05:21 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 15:05:21 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 15:05:21 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 15:05:21 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 15:05:21 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 15:05:21 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 15:05:21 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 15:05:21 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 15:05:21 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 15:05:21 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 15:05:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:05:21 INFO - https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 15:05:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 15:05:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 15:05:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 15:05:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 15:05:22 INFO - Downloaded 22056809 bytes. 15:05:22 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 15:05:22 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 15:05:23 INFO - Return code: 0 15:05:23 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 15:05:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:05:23 INFO - https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 15:05:23 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 15:05:23 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 15:05:23 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 15:05:23 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 15:05:24 INFO - Downloaded 22056809 bytes. 15:05:24 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 15:05:24 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 15:05:25 INFO - Return code: 0 15:05:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:05:25 INFO - https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 15:05:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 15:05:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 15:05:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 15:05:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 15:05:26 INFO - Downloaded 10713410 bytes. 15:05:26 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 15:05:26 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 15:05:26 INFO - Return code: 0 15:05: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')]} 15:05:26 INFO - https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 15:05:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 15:05:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 15:05:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 15:05:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 15:05:28 INFO - Downloaded 54828117 bytes. 15:05:28 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 15:05:28 INFO - mkdir: /builds/slave/test/properties 15:05:28 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:05:28 INFO - Writing to file /builds/slave/test/properties/build_url 15:05:28 INFO - Contents: 15:05:28 INFO - build_url:https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 15:05:28 INFO - Running post-action listener: _resource_record_post_action 15:05:28 INFO - Running post-action listener: set_extra_try_arguments 15:05:28 INFO - ##### 15:05:28 INFO - ##### Running populate-webroot step. 15:05:28 INFO - ##### 15:05:28 INFO - Running pre-action listener: _resource_record_pre_action 15:05:28 INFO - Running main action method: populate_webroot 15:05:28 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:05:28 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:05:28 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:05:28 INFO - '--tppagecycles', 15:05:28 INFO - '7'], 15:05:28 INFO - 'tests': ['tsvgm']}}, 15:05:28 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 15:05:28 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 15:05:28 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:05:28 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 15:05:28 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 15:05:28 INFO - 'tests': ['dromaeo_css', 'kraken']}, 15:05:28 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:05:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:05:28 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:05:28 INFO - 'talos_options': ['--e10s'], 15:05:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:05:28 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:05:28 INFO - 'tests': ['damp', 'tps']}, 15:05:28 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:05:28 INFO - 'talos_options': ['--e10s'], 15:05:28 INFO - 'tests': ['damp', 'tps']}, 15:05:28 INFO - 'g3': {'tests': ['dromaeo_dom']}, 15:05:28 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:05:28 INFO - 'other': {'tests': ['a11yr', 15:05:28 INFO - 'ts_paint', 15:05:28 INFO - 'tpaint', 15:05:28 INFO - 'sessionrestore', 15:05:28 INFO - 'sessionrestore_no_auto_restore']}, 15:05:28 INFO - 'other-e10s': {'talos_options': ['--e10s'], 15:05:28 INFO - 'tests': ['a11yr', 15:05:28 INFO - 'ts_paint', 15:05:28 INFO - 'tpaint', 15:05:28 INFO - 'sessionrestore', 15:05:28 INFO - 'sessionrestore_no_auto_restore']}, 15:05:28 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 15:05:28 INFO - 'tests': ['a11yr', 15:05:28 INFO - 'ts_paint', 15:05:28 INFO - 'tpaint', 15:05:28 INFO - 'sessionrestore', 15:05:28 INFO - 'sessionrestore_no_auto_restore']}, 15:05:28 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 15:05:28 INFO - 'tests': ['a11yr', 15:05:28 INFO - 'ts_paint', 15:05:28 INFO - 'tpaint', 15:05:28 INFO - 'sessionrestore', 15:05:28 INFO - 'sessionrestore_no_auto_restore']}, 15:05:28 INFO - 'other_l64': {'tests': ['a11yr', 15:05:28 INFO - 'ts_paint', 15:05:28 INFO - 'tpaint', 15:05:28 INFO - 'sessionrestore', 15:05:28 INFO - 'sessionrestore_no_auto_restore']}, 15:05:28 INFO - 'other_nol64': {'tests': ['a11yr', 15:05:28 INFO - 'ts_paint', 15:05:28 INFO - 'tpaint', 15:05:28 INFO - 'sessionrestore', 15:05:28 INFO - 'sessionrestore_no_auto_restore']}, 15:05:28 INFO - 'svgr': {'tests': ['tsvgx', 15:05:28 INFO - 'tsvgr_opacity', 15:05:28 INFO - 'tart', 15:05:28 INFO - 'tscrollx', 15:05:28 INFO - 'cart']}, 15:05:28 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 15:05:28 INFO - 'tests': ['tsvgx', 15:05:28 INFO - 'tsvgr_opacity', 15:05:28 INFO - 'tart', 15:05:28 INFO - 'tscrollx', 15:05:28 INFO - 'cart']}, 15:05:28 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:05:28 INFO - 'tests': ['tp5o']}, 15:05:28 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:05:28 INFO - 'talos_options': ['--e10s'], 15:05:28 INFO - 'tests': ['tp5o']}, 15:05:28 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:05:28 INFO - 'talos_options': ['--xperf_path', 15:05:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:05:28 INFO - 'tests': ['tp5n']}, 15:05:28 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:05:28 INFO - 'talos_options': ['--e10s', 15:05:28 INFO - '--xperf_path', 15:05:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:05:28 INFO - 'tests': ['tp5n']}}, 15:05:28 INFO - 'talos.zip': {'path': '', 15:05:28 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:05:28 INFO - Running post-action listener: _resource_record_post_action 15:05:28 INFO - ##### 15:05:28 INFO - ##### Running create-virtualenv step. 15:05:28 INFO - ##### 15:05:28 INFO - Running pre-action listener: _resource_record_pre_action 15:05:28 INFO - Running main action method: create_virtualenv 15:05:28 INFO - Creating virtualenv /builds/slave/test/build/venv 15:05:28 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 15:05:28 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:05:29 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:05:29 INFO - Using real prefix '/usr' 15:05:29 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:05:29 INFO - Installing distribute.............................................................................................................................................................................................done. 15:05:31 INFO - Installing pip.................done. 15:05:31 INFO - Return code: 0 15:05:31 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:05:31 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')]} 15:05:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:31 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')]} 15:05:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:31 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 0x7fba0e7d9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd0b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd83b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe67100>, '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 0xe68000>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe68490>, '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': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', '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 15:05:31 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 15:05:31 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 15:05:31 INFO - Using env: {'DISPLAY': ':0', 15:05:31 INFO - 'HOME': '/home/cltbld', 15:05:31 INFO - 'LANG': 'en_US.UTF-8', 15:05:31 INFO - 'LANGUAGE': 'en_US:en', 15:05:31 INFO - 'LOGNAME': 'cltbld', 15:05:31 INFO - 'MAIL': '/var/mail/cltbld', 15:05:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:31 INFO - 'MOZ_NO_REMOTE': '1', 15:05:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:31 INFO - 'NO_EM_RESTART': '1', 15:05:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:31 INFO - 'PWD': '/builds/slave/test', 15:05:31 INFO - 'SHELL': '/bin/bash', 15:05:31 INFO - 'SHLVL': '1', 15:05:31 INFO - 'TERM': 'linux', 15:05:31 INFO - 'TMOUT': '86400', 15:05:31 INFO - 'USER': 'cltbld', 15:05:31 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', 15:05:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:31 INFO - '_': '/tools/buildbot/bin/python'} 15:05:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:31 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 15:05:31 INFO - Cleaning up... 15:05:31 INFO - Return code: 0 15:05:31 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 15:05:31 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')]} 15:05:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:31 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')]} 15:05:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:31 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 0x7fba0e7d9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd0b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd83b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe67100>, '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 0xe68000>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe68490>, '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': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', '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 15:05:31 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 15:05:31 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 15:05:31 INFO - Using env: {'DISPLAY': ':0', 15:05:31 INFO - 'HOME': '/home/cltbld', 15:05:31 INFO - 'LANG': 'en_US.UTF-8', 15:05:31 INFO - 'LANGUAGE': 'en_US:en', 15:05:31 INFO - 'LOGNAME': 'cltbld', 15:05:31 INFO - 'MAIL': '/var/mail/cltbld', 15:05:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:31 INFO - 'MOZ_NO_REMOTE': '1', 15:05:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:31 INFO - 'NO_EM_RESTART': '1', 15:05:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:31 INFO - 'PWD': '/builds/slave/test', 15:05:31 INFO - 'SHELL': '/bin/bash', 15:05:31 INFO - 'SHLVL': '1', 15:05:31 INFO - 'TERM': 'linux', 15:05:31 INFO - 'TMOUT': '86400', 15:05:31 INFO - 'USER': 'cltbld', 15:05:31 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', 15:05:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:31 INFO - '_': '/tools/buildbot/bin/python'} 15:05:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:31 INFO - Downloading/unpacking psutil>=0.7.1 15:05:31 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 15:05:31 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 15:05:31 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 15:05:31 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 15:05:31 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 15:05:31 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 15:05:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:05:33 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:05:33 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:05:33 INFO - Installing collected packages: psutil 15:05:33 INFO - Running setup.py install for psutil 15:05:33 INFO - building 'psutil._psutil_linux' extension 15:05:33 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 15:05:34 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 15:05:34 INFO - building 'psutil._psutil_posix' extension 15:05:34 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 15:05:34 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 15:05:34 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:05:34 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:05:34 INFO - Successfully installed psutil 15:05:34 INFO - Cleaning up... 15:05:34 INFO - Return code: 0 15:05:34 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 15:05: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')]} 15:05:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05: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')]} 15:05:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:34 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fba0e7d9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd0b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd83b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe67100>, '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 0xe68000>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe68490>, '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': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', '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 15:05:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 15:05:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 15:05:34 INFO - Using env: {'DISPLAY': ':0', 15:05:34 INFO - 'HOME': '/home/cltbld', 15:05:34 INFO - 'LANG': 'en_US.UTF-8', 15:05:34 INFO - 'LANGUAGE': 'en_US:en', 15:05:34 INFO - 'LOGNAME': 'cltbld', 15:05:34 INFO - 'MAIL': '/var/mail/cltbld', 15:05:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:34 INFO - 'MOZ_NO_REMOTE': '1', 15:05:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:34 INFO - 'NO_EM_RESTART': '1', 15:05:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:34 INFO - 'PWD': '/builds/slave/test', 15:05:34 INFO - 'SHELL': '/bin/bash', 15:05:34 INFO - 'SHLVL': '1', 15:05:34 INFO - 'TERM': 'linux', 15:05:34 INFO - 'TMOUT': '86400', 15:05:34 INFO - 'USER': 'cltbld', 15:05:34 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', 15:05:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:34 INFO - '_': '/tools/buildbot/bin/python'} 15:05:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:34 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 15:05:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:36 INFO - Downloading mozsystemmonitor-0.0.tar.gz 15:05:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:05:36 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 15:05:36 INFO - Installing collected packages: mozsystemmonitor 15:05:36 INFO - Running setup.py install for mozsystemmonitor 15:05:36 INFO - Successfully installed mozsystemmonitor 15:05:36 INFO - Cleaning up... 15:05:36 INFO - Return code: 0 15:05:36 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:05:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:05:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:05:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fba0e7d9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd0b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd83b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe67100>, '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 0xe68000>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe68490>, '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': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', '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 15:05:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 15:05:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 15:05:36 INFO - Using env: {'DISPLAY': ':0', 15:05:36 INFO - 'HOME': '/home/cltbld', 15:05:36 INFO - 'LANG': 'en_US.UTF-8', 15:05:36 INFO - 'LANGUAGE': 'en_US:en', 15:05:36 INFO - 'LOGNAME': 'cltbld', 15:05:36 INFO - 'MAIL': '/var/mail/cltbld', 15:05:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:36 INFO - 'MOZ_NO_REMOTE': '1', 15:05:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:36 INFO - 'NO_EM_RESTART': '1', 15:05:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:36 INFO - 'PWD': '/builds/slave/test', 15:05:36 INFO - 'SHELL': '/bin/bash', 15:05:36 INFO - 'SHLVL': '1', 15:05:36 INFO - 'TERM': 'linux', 15:05:36 INFO - 'TMOUT': '86400', 15:05:36 INFO - 'USER': 'cltbld', 15:05:36 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', 15:05:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:36 INFO - '_': '/tools/buildbot/bin/python'} 15:05:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:36 INFO - Downloading/unpacking blobuploader==1.2.4 15:05:36 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 15:05:36 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 15:05:36 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 15:05:36 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 15:05:36 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 15:05:36 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 15:05:38 INFO - Downloading blobuploader-1.2.4.tar.gz 15:05:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:05:38 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:05:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:05:39 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:05:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:39 INFO - Downloading docopt-0.6.1.tar.gz 15:05:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:05:39 INFO - Installing collected packages: blobuploader, requests, docopt 15:05:39 INFO - Running setup.py install for blobuploader 15:05:39 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:05:39 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:05:39 INFO - Running setup.py install for requests 15:05:39 INFO - Running setup.py install for docopt 15:05:40 INFO - Successfully installed blobuploader requests docopt 15:05:40 INFO - Cleaning up... 15:05:40 INFO - Return code: 0 15:05:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:05: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')]} 15:05:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05: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')]} 15:05:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:40 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 0x7fba0e7d9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd0b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd83b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe67100>, '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 0xe68000>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe68490>, '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': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', '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 15:05:40 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 15:05:40 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 15:05:40 INFO - Using env: {'DISPLAY': ':0', 15:05:40 INFO - 'HOME': '/home/cltbld', 15:05:40 INFO - 'LANG': 'en_US.UTF-8', 15:05:40 INFO - 'LANGUAGE': 'en_US:en', 15:05:40 INFO - 'LOGNAME': 'cltbld', 15:05:40 INFO - 'MAIL': '/var/mail/cltbld', 15:05:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:40 INFO - 'MOZ_NO_REMOTE': '1', 15:05:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:40 INFO - 'NO_EM_RESTART': '1', 15:05:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:40 INFO - 'PWD': '/builds/slave/test', 15:05:40 INFO - 'SHELL': '/bin/bash', 15:05:40 INFO - 'SHLVL': '1', 15:05:40 INFO - 'TERM': 'linux', 15:05:40 INFO - 'TMOUT': '86400', 15:05:40 INFO - 'USER': 'cltbld', 15:05:40 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', 15:05:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:40 INFO - '_': '/tools/buildbot/bin/python'} 15:05:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:05:40 INFO - Running setup.py (path:/tmp/pip-MCrvEM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:05:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:05:40 INFO - Running setup.py (path:/tmp/pip-ITUzHF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:05:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:05:40 INFO - Running setup.py (path:/tmp/pip-MjhxOK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:05:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:05:40 INFO - Running setup.py (path:/tmp/pip-zMZvAf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:05:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:05:40 INFO - Running setup.py (path:/tmp/pip-EZdUPo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:05:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:05:40 INFO - Running setup.py (path:/tmp/pip-C1SCe1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:05:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:05:40 INFO - Running setup.py (path:/tmp/pip-e54aBk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:05:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:05:40 INFO - Running setup.py (path:/tmp/pip-q9psQF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:05:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:05:40 INFO - Running setup.py (path:/tmp/pip-5wKU0m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:05:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:05:40 INFO - Running setup.py (path:/tmp/pip-I7gS7f-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:05:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:05:41 INFO - Running setup.py (path:/tmp/pip-9vtiKG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:05:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:05:41 INFO - Running setup.py (path:/tmp/pip-Jlbk_b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:05:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:05:41 INFO - Running setup.py (path:/tmp/pip-P9OZdO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:05:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:05:41 INFO - Running setup.py (path:/tmp/pip-WjPH4K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:05:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:05:41 INFO - Running setup.py (path:/tmp/pip-Zn3rq5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:05:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:05:41 INFO - Running setup.py (path:/tmp/pip-Z0q4lZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:05:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:05:41 INFO - Running setup.py (path:/tmp/pip-5SmwaC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:05:41 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:05:41 INFO - Running setup.py install for manifestparser 15:05:41 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:05:41 INFO - Running setup.py install for mozcrash 15:05:41 INFO - Running setup.py install for mozdebug 15:05:41 INFO - Running setup.py install for mozdevice 15:05:41 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 15:05:41 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:05:41 INFO - Running setup.py install for mozfile 15:05:42 INFO - Running setup.py install for mozhttpd 15:05:42 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:05:42 INFO - Running setup.py install for mozinfo 15:05:42 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:05:42 INFO - Running setup.py install for mozInstall 15:05:42 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:05:42 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:05:42 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:05:42 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:05:42 INFO - Running setup.py install for mozleak 15:05:42 INFO - Running setup.py install for mozlog 15:05:42 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:05:42 INFO - Running setup.py install for moznetwork 15:05:42 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:05:42 INFO - Running setup.py install for mozprocess 15:05:42 INFO - Running setup.py install for mozprofile 15:05:42 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:05:42 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:05:42 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:05:42 INFO - Running setup.py install for mozrunner 15:05:43 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:05:43 INFO - Running setup.py install for mozscreenshot 15:05:43 INFO - Running setup.py install for moztest 15:05:43 INFO - Running setup.py install for mozversion 15:05:43 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:05:43 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:05:43 INFO - Cleaning up... 15:05:43 INFO - Return code: 0 15:05:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:05:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:05:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:05:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:43 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 0x7fba0e7d9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd0b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd83b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe67100>, '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 0xe68000>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe68490>, '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': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', '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 15:05:43 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 15:05:43 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 15:05:43 INFO - Using env: {'DISPLAY': ':0', 15:05:43 INFO - 'HOME': '/home/cltbld', 15:05:43 INFO - 'LANG': 'en_US.UTF-8', 15:05:43 INFO - 'LANGUAGE': 'en_US:en', 15:05:43 INFO - 'LOGNAME': 'cltbld', 15:05:43 INFO - 'MAIL': '/var/mail/cltbld', 15:05:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:43 INFO - 'MOZ_NO_REMOTE': '1', 15:05:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:43 INFO - 'NO_EM_RESTART': '1', 15:05:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:43 INFO - 'PWD': '/builds/slave/test', 15:05:43 INFO - 'SHELL': '/bin/bash', 15:05:43 INFO - 'SHLVL': '1', 15:05:43 INFO - 'TERM': 'linux', 15:05:43 INFO - 'TMOUT': '86400', 15:05:43 INFO - 'USER': 'cltbld', 15:05:43 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', 15:05:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:43 INFO - '_': '/tools/buildbot/bin/python'} 15:05:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:05:43 INFO - Running setup.py (path:/tmp/pip-jky5H_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:05:43 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)) 15:05:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:05:43 INFO - Running setup.py (path:/tmp/pip-nhuqDC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:05:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 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)) 15:05:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:05:43 INFO - Running setup.py (path:/tmp/pip-72DJui-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:05:43 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)) 15:05:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:05:43 INFO - Running setup.py (path:/tmp/pip-FMxwV1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:05:43 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)) 15:05:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:05:43 INFO - Running setup.py (path:/tmp/pip-fp7MyF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:05:43 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)) 15:05:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:05:43 INFO - Running setup.py (path:/tmp/pip-PE1Dlh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:05:44 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)) 15:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:05:44 INFO - Running setup.py (path:/tmp/pip-PxnpOs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:05:44 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)) 15:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:05:44 INFO - Running setup.py (path:/tmp/pip-iKR2Zk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:05:44 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)) 15:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:05:44 INFO - Running setup.py (path:/tmp/pip-hgTz9M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:05:44 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)) 15:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:05:44 INFO - Running setup.py (path:/tmp/pip-WjlQLe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:05:44 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)) 15:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:05:44 INFO - Running setup.py (path:/tmp/pip-_oUJfo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:05:44 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)) 15:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:05:44 INFO - Running setup.py (path:/tmp/pip-AE_BFP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:05:44 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)) 15:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:05:44 INFO - Running setup.py (path:/tmp/pip-4cb6N4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:05:44 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)) 15:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:05:44 INFO - Running setup.py (path:/tmp/pip-bXkgn1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:05:44 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)) 15:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:05:44 INFO - Running setup.py (path:/tmp/pip-5QNwh0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:05:44 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)) 15:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:05:44 INFO - Running setup.py (path:/tmp/pip-IugUPO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:05:44 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)) 15:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:05:44 INFO - Running setup.py (path:/tmp/pip-EkEqPo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:05:44 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)) 15:05:44 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:05:44 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:05:44 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)) 15:05:44 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)) 15:05:44 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)) 15:05:44 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:05:44 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 15:05:44 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 15:05:44 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 15:05:44 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 15:05:44 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 15:05:44 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 15:05:46 INFO - Downloading blessings-1.6.tar.gz 15:05:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:05:46 INFO - Installing collected packages: blessings 15:05:46 INFO - Running setup.py install for blessings 15:05:46 INFO - Successfully installed blessings 15:05:46 INFO - Cleaning up... 15:05:46 INFO - Return code: 0 15:05:46 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:05:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:05:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:05:47 INFO - Reading from file tmpfile_stdout 15:05:47 INFO - Current package versions: 15:05:47 INFO - argparse == 1.2.1 15:05:47 INFO - blessings == 1.6 15:05:47 INFO - blobuploader == 1.2.4 15:05:47 INFO - docopt == 0.6.1 15:05:47 INFO - manifestparser == 1.1 15:05:47 INFO - mozInstall == 1.12 15:05:47 INFO - mozcrash == 0.16 15:05:47 INFO - mozdebug == 0.1 15:05:47 INFO - mozdevice == 0.48 15:05:47 INFO - mozfile == 1.2 15:05:47 INFO - mozhttpd == 0.7 15:05:47 INFO - mozinfo == 0.9 15:05:47 INFO - mozleak == 0.1 15:05:47 INFO - mozlog == 3.1 15:05:47 INFO - moznetwork == 0.27 15:05:47 INFO - mozprocess == 0.22 15:05:47 INFO - mozprofile == 0.28 15:05:47 INFO - mozrunner == 6.11 15:05:47 INFO - mozscreenshot == 0.1 15:05:47 INFO - mozsystemmonitor == 0.0 15:05:47 INFO - moztest == 0.7 15:05:47 INFO - mozversion == 1.4 15:05:47 INFO - psutil == 3.1.1 15:05:47 INFO - requests == 1.2.3 15:05:47 INFO - wsgiref == 0.1.2 15:05:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:05:47 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')]} 15:05:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:47 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')]} 15:05:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:47 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 0x7fba0e7d9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd0b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd83b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe67100>, '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 0xe68000>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe68490>, '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': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', '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 15:05:47 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 15:05:47 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 15:05:47 INFO - Using env: {'DISPLAY': ':0', 15:05:47 INFO - 'HOME': '/home/cltbld', 15:05:47 INFO - 'LANG': 'en_US.UTF-8', 15:05:47 INFO - 'LANGUAGE': 'en_US:en', 15:05:47 INFO - 'LOGNAME': 'cltbld', 15:05:47 INFO - 'MAIL': '/var/mail/cltbld', 15:05:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:47 INFO - 'MOZ_NO_REMOTE': '1', 15:05:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:47 INFO - 'NO_EM_RESTART': '1', 15:05:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:47 INFO - 'PWD': '/builds/slave/test', 15:05:47 INFO - 'SHELL': '/bin/bash', 15:05:47 INFO - 'SHLVL': '1', 15:05:47 INFO - 'TERM': 'linux', 15:05:47 INFO - 'TMOUT': '86400', 15:05:47 INFO - 'USER': 'cltbld', 15:05:47 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', 15:05:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:47 INFO - '_': '/tools/buildbot/bin/python'} 15:05:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:47 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)) 15:05:47 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)) 15:05:47 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)) 15:05:47 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)) 15:05:47 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)) 15:05:47 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)) 15:05:47 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)) 15:05:47 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)) 15:05:47 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)) 15:05:47 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)) 15:05:47 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)) 15:05:47 INFO - Cleaning up... 15:05:47 INFO - Return code: 0 15:05:47 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 15:05:47 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')]} 15:05:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:47 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')]} 15:05:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:47 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 0x7fba0e7d9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd0b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd83b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe67100>, '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 0xe68000>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe68490>, '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': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', '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 15:05:47 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 15:05:47 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 15:05:47 INFO - Using env: {'DISPLAY': ':0', 15:05:47 INFO - 'HOME': '/home/cltbld', 15:05:47 INFO - 'LANG': 'en_US.UTF-8', 15:05:47 INFO - 'LANGUAGE': 'en_US:en', 15:05:47 INFO - 'LOGNAME': 'cltbld', 15:05:47 INFO - 'MAIL': '/var/mail/cltbld', 15:05:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:47 INFO - 'MOZ_NO_REMOTE': '1', 15:05:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:47 INFO - 'NO_EM_RESTART': '1', 15:05:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:47 INFO - 'PWD': '/builds/slave/test', 15:05:47 INFO - 'SHELL': '/bin/bash', 15:05:47 INFO - 'SHLVL': '1', 15:05:47 INFO - 'TERM': 'linux', 15:05:47 INFO - 'TMOUT': '86400', 15:05:47 INFO - 'USER': 'cltbld', 15:05:47 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', 15:05:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:47 INFO - '_': '/tools/buildbot/bin/python'} 15:05:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:47 INFO - Downloading/unpacking jsonschema 15:05:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:49 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 15:05:49 INFO - Downloading/unpacking functools32 (from jsonschema) 15:05:49 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 15:05:49 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 15:05:49 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 15:05:49 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 15:05:49 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 15:05:49 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 15:05:49 INFO - Downloading functools32-3.2.3-2.tar.gz 15:05:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 15:05:49 INFO - warning: no files found matching '*.txt' 15:05:49 INFO - no previously-included directories found matching 'build' 15:05:49 INFO - no previously-included directories found matching 'dist' 15:05:49 INFO - no previously-included directories found matching '.git*' 15:05:49 INFO - Installing collected packages: jsonschema, functools32 15:05:49 INFO - Running setup.py install for functools32 15:05:49 INFO - warning: no files found matching '*.txt' 15:05:49 INFO - no previously-included directories found matching 'build' 15:05:49 INFO - no previously-included directories found matching 'dist' 15:05:49 INFO - no previously-included directories found matching '.git*' 15:05:49 INFO - Successfully installed jsonschema functools32 15:05:49 INFO - Cleaning up... 15:05:49 INFO - Return code: 0 15:05:49 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 15:05:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:05:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:05:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:05:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:05:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:05:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fba0e7d9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd0b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd83b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe67100>, '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 0xe68000>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe68490>, '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': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', '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 15:05:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 15:05:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 15:05:49 INFO - Using env: {'DISPLAY': ':0', 15:05:49 INFO - 'HOME': '/home/cltbld', 15:05:49 INFO - 'LANG': 'en_US.UTF-8', 15:05:49 INFO - 'LANGUAGE': 'en_US:en', 15:05:49 INFO - 'LOGNAME': 'cltbld', 15:05:49 INFO - 'MAIL': '/var/mail/cltbld', 15:05:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:05:49 INFO - 'MOZ_NO_REMOTE': '1', 15:05:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:05:49 INFO - 'NO_EM_RESTART': '1', 15:05:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:05:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:05:49 INFO - 'PWD': '/builds/slave/test', 15:05:49 INFO - 'SHELL': '/bin/bash', 15:05:49 INFO - 'SHLVL': '1', 15:05:49 INFO - 'TERM': 'linux', 15:05:49 INFO - 'TMOUT': '86400', 15:05:49 INFO - 'USER': 'cltbld', 15:05:49 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', 15:05:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:05:49 INFO - '_': '/tools/buildbot/bin/python'} 15:05:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:05:50 INFO - Downloading/unpacking flake8 15:05:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:51 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 15:05:51 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 15:05: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 15:05: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 15:05: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 15:05: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 15:05: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 15:05: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 15:05:52 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 15:05:52 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 15:05:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:52 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 15:05:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:05:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:05:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:05:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 15:05:52 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 15:05:52 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 15:05:52 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 15:05:52 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 15:05:52 INFO - no previously-included directories found matching 'docs/_build' 15:05:52 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 15:05:52 INFO - Running setup.py install for pep8 15:05:52 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 15:05:52 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 15:05:52 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 15:05:52 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 15:05:52 INFO - no previously-included directories found matching 'docs/_build' 15:05:52 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 15:05:52 INFO - Successfully installed flake8 mccabe pyflakes pep8 15:05:52 INFO - Cleaning up... 15:05:52 INFO - Return code: 0 15:05:52 INFO - Running post-action listener: _resource_record_post_action 15:05:52 INFO - Running post-action listener: _start_resource_monitoring 15:05:52 INFO - Starting resource monitoring. 15:05:52 INFO - ##### 15:05:52 INFO - ##### Running install step. 15:05:52 INFO - ##### 15:05:52 INFO - Running pre-action listener: _resource_record_pre_action 15:05:52 INFO - Running main action method: install 15:05:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:05:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:05:53 INFO - Reading from file tmpfile_stdout 15:05:53 INFO - Detecting whether we're running mozinstall >=1.0... 15:05:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:05:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:05:53 INFO - Reading from file tmpfile_stdout 15:05:53 INFO - Output received: 15:05:53 INFO - Usage: mozinstall [options] installer 15:05:53 INFO - Options: 15:05:53 INFO - -h, --help show this help message and exit 15:05:53 INFO - -d DEST, --destination=DEST 15:05:53 INFO - Directory to install application into. [default: 15:05:53 INFO - "/builds/slave/test"] 15:05:53 INFO - --app=APP Application being installed. [default: firefox] 15:05:53 INFO - mkdir: /builds/slave/test/build/application 15:05:53 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 15:05:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 15:06:09 INFO - Reading from file tmpfile_stdout 15:06:09 INFO - Output received: 15:06:09 INFO - /builds/slave/test/build/application/firefox/firefox 15:06:09 INFO - Running post-action listener: _resource_record_post_action 15:06:09 INFO - ##### 15:06:09 INFO - ##### Running run-tests step. 15:06:09 INFO - ##### 15:06:09 INFO - Running pre-action listener: _resource_record_pre_action 15:06:09 INFO - Running main action method: run_tests 15:06:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:06:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:06:09 INFO - Python 2.7.3 15:06:09 INFO - Return code: 0 15:06:09 INFO - grabbing minidump binary from tooltool 15:06:09 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')]} 15:06:09 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 0xe67100>, '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 0xe68000>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe68490>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:06:09 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 15:06:09 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 15:06:09 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:06:09 INFO - Return code: 0 15:06:09 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 15:06:09 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:06:09 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:06:09 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 15:06:09 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:06:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 15:06:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 15:06:10 INFO - Return code: 0 15:06:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-061', '--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 15:06:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-061 --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 15:06:10 INFO - Using env: {'DISPLAY': ':0', 15:06:10 INFO - 'HOME': '/home/cltbld', 15:06:10 INFO - 'LANG': 'en_US.UTF-8', 15:06:10 INFO - 'LANGUAGE': 'en_US:en', 15:06:10 INFO - 'LOGNAME': 'cltbld', 15:06:10 INFO - 'MAIL': '/var/mail/cltbld', 15:06:10 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:06:10 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 15:06:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:06:10 INFO - 'MOZ_NO_REMOTE': '1', 15:06:10 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:06:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:06:10 INFO - 'NO_EM_RESTART': '1', 15:06:10 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:06:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:06:10 INFO - 'PWD': '/builds/slave/test', 15:06:10 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:06:10 INFO - 'SHELL': '/bin/bash', 15:06:10 INFO - 'SHLVL': '1', 15:06:10 INFO - 'TERM': 'linux', 15:06:10 INFO - 'TMOUT': '86400', 15:06:10 INFO - 'USER': 'cltbld', 15:06:10 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411', 15:06:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:06:10 INFO - '_': '/tools/buildbot/bin/python'} 15:06:10 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-061', '--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 15:06:10 INFO - mozversion application_buildid: 20160226135901 15:06:10 INFO - mozversion application_changeset: 0df0a7abe8a5bc93b36ec4065bde09f65257db59 15:06:10 INFO - mozversion application_display_name: Nightly 15:06:10 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:06:10 INFO - mozversion application_name: Firefox 15:06:10 INFO - mozversion application_remotingname: firefox 15:06:10 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 15:06:10 INFO - mozversion application_vendor: Mozilla 15:06:10 INFO - mozversion application_version: 47.0a1 15:06:10 INFO - mozversion platform_buildid: 20160226135901 15:06:10 INFO - mozversion platform_changeset: 0df0a7abe8a5bc93b36ec4065bde09f65257db59 15:06:10 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 15:06:10 INFO - mozversion platform_version: 47.0a1 15:06:10 INFO - using testdate: 1456527970 15:06:10 INFO - actual date: 1456527970 15:06:10 INFO - starting webserver on 'localhost:53043' 15:06:10 INFO - SUITE-START | Running 2 tests 15:06:10 INFO - TEST-START | dromaeo_css 15:06:10 INFO - operating with platform_type : linux_ 15:06:10 INFO - Initialising browser for dromaeo_css test... 15:06:10 INFO - TEST-INFO | started process 32500 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmptpdCL7/profile http://localhost:53043/getInfo.html) 15:06:14 INFO - PROCESS | 32500 | 15:06:14 INFO - PROCESS | 32500 | (process:32581): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 15:06:15 INFO - PROCESS | 32500 | __metrics Screen width/height:1600/1200 15:06:15 INFO - PROCESS | 32500 | colorDepth:24 15:06:15 INFO - PROCESS | 32500 | Browser inner width/height: 1024/697 15:06:15 INFO - PROCESS | 32500 | __metrics 15:06:15 ERROR - PROCESS | 32500 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 15:06:15 INFO - PROCESS | 32500 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:06:15 INFO - PROCESS | 32500 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:06:15 INFO - PROCESS | 32500 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:06:15 INFO - PROCESS | 32500 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:06:15 INFO - PROCESS | 32500 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:06:15 INFO - PROCESS | 32500 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:06:15 INFO - PROCESS | 32500 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:06:15 INFO - PROCESS | 32500 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:06:15 INFO - PROCESS | 32500 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:06:16 INFO - TEST-INFO | 32500: exit 0 15:06:16 INFO - Browser initialized. 15:06:16 INFO - Running cycle 1/1 for dromaeo_css test... 15:06:16 INFO - TEST-INFO | started process 32632 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmptpdCL7/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 15:06:18 INFO - PROCESS | 32632 | 15:06:18 INFO - PROCESS | 32632 | (process:32689): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 15:06:28 INFO - PROCESS | 32632 | RSS: Main: 158629888 15:06:28 INFO - PROCESS | 32632 | 15:07:18 INFO - PROCESS | 32632 | 1456528038230 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] 15:09:29 INFO - PROCESS | 32632 | Cycle 1(1): loaded http://localhost:53043/tests/dromaeo/cssquery-dojo.html (next: http://localhost:53043/tests/dromaeo/cssquery-ext.html) 15:09:30 INFO - PROCESS | 32632 | RSS: Main: 165904384 15:09:30 INFO - PROCESS | 32632 | 15:12:32 INFO - PROCESS | 32632 | Cycle 1(1): loaded http://localhost:53043/tests/dromaeo/cssquery-ext.html (next: http://localhost:53043/tests/dromaeo/cssquery-jquery.html) 15:12:33 INFO - PROCESS | 32632 | RSS: Main: 161914880 15:12:33 INFO - PROCESS | 32632 | 15:15:34 INFO - PROCESS | 32632 | Cycle 1(1): loaded http://localhost:53043/tests/dromaeo/cssquery-jquery.html (next: http://localhost:53043/tests/dromaeo/cssquery-mootools.html) 15:15:35 INFO - PROCESS | 32632 | RSS: Main: 163385344 15:15:35 INFO - PROCESS | 32632 | 15:18:37 INFO - PROCESS | 32632 | Cycle 1(1): loaded http://localhost:53043/tests/dromaeo/cssquery-mootools.html (next: http://localhost:53043/tests/dromaeo/cssquery-prototype.html) 15:18:37 INFO - PROCESS | 32632 | RSS: Main: 161107968 15:18:37 INFO - PROCESS | 32632 | 15:21:40 INFO - PROCESS | 32632 | Cycle 1(1): loaded http://localhost:53043/tests/dromaeo/cssquery-prototype.html (next: http://localhost:53043/tests/dromaeo/cssquery-yui.html) 15:21:41 INFO - PROCESS | 32632 | RSS: Main: 161107968 15:21:41 INFO - PROCESS | 32632 | 15:24:43 INFO - PROCESS | 32632 | Cycle 1(1): loaded http://localhost:53043/tests/dromaeo/cssquery-yui.html (next: http://localhost:53043/tests/dromaeo/cssquery-dojo.html) 15:24:43 INFO - PROCESS | 32632 | RSS: Main: 165388288 15:24:43 INFO - PROCESS | 32632 | 15:24:43 INFO - PROCESS | 32632 | __start_tp_report 15:24:43 INFO - PROCESS | 32632 | _x_x_mozilla_page_load 15:24:43 INFO - PROCESS | 32632 | _x_x_mozilla_page_load_details 15:24:43 INFO - PROCESS | 32632 | |i|pagename|runs| 15:24:43 INFO - PROCESS | 32632 | |0;dojo.html;2593.7017243017053;2620.3056190109637;2652.708202097769;2660.201939418174;2666.5866790647447;4425.203463376591;4480.283154695246;4491.438570178728;4516.254817955041;4544.227481328174;4512.706674066183;4514.841980530682;4528.592426681598;4549.272116461367;4582.816687332503;4069.674426045917;4158.4594002779595;4166.9791651041705;4289.613934745872;4309.4397728295435;4115.670746340301;4138.1103062841485;4172.290710579194;4236.9364459533135;4282.850100246492;4117.114820313617;4126.360414135784;4139.834406623761;4167.1040726244;4175.97912010438;4149.854755083587;4175;4185.267578173807;4191.11986482839;4208.3266677331785;4042.15114825884;4119.340905455113;4158.896027599304;4202.201581699467;4223.450951376301;4397.340398940185;4431.955680443187;4432.645388368923;4436.911261774746;4484.506704262529;4758.643101767381;4786.593139583139;4787.40157480315;4792.329073929653;4809.879753006167;4854.223324268136;4896.1186986342445;4902.093112774148;4937.185364414867;4939.456659767423;4466.754328511963;4479.552044795527;4509.594136527729;4518.367428560005;4539.614132798749;4759.38128043359;4808.831690890802;4949.455559888409;4951.628627852925;4995.925061124086;4767.237242041326;4770.403699537558;4772.045590881838;4775.068861572029;4807.687500312469;4691.413573303337;4796.8081276749235;4848.515148485194;4864.294677271847;4890.951090489049;4570.88572785683;4719.528047195253;4730.645201609893;4747.501512341223;4760.214564596803;4753.809847606126;4758.8340856489685;4761.142994261067;4769.046190761862;4821.132196204647;4090.959090409058;4101.282275601818;4102.077032667626;4130.731502452331;4134.235166494208;3481.9477707834403;3562.750607457453;3604.2611264690677;3633.091727068233;3646.2707458507875;4151.14901445203;4186.246475634415;4190.28765109932;4220.388043733703;4245.320748680197;4794.87320479687;4807.95192048082;4830.372051633265;4832.9275060874115;4843.128236917389;4116.526599441103;4125.422440858282;4166.041810383568;4207.242696314693;4235.237657221668;4321.827126914888;4322.113966636832;4324.805383757675;4325.134973005412;4333.696641235147;4385.342198670225;4581.816727330936;4583.908321833612;4598.080383923162;4630.374899388674;4820.566149046603;4868.90262194747;4879.04858552593;4897.069556784342;4922.803087876445;4544.136614043321;4564.566366195206;4581.312803079565;4584.495705472462;4636.44362676481;4626.699264547794;4774.4509381421585;4778.235482322812;4789.8504358952905;4807.230843065093;4789.664723469463;4813.7593120343145;4853.39332583427;4857.805687772591;4891.339669144762;4663.440387153563;4667.906641867075;4674.041821426531;4713.740744259098;4720.150372932905;4505.594496495331;4651.86044418668;4666.2767271073035;4670.486246512813;4677.204875171297;4472.485664148665;4539.659525535532;4554.453465584151;4598.839040633696;4624.7687615618415;4593.5194994703825;4658.184817656828;4673.158831410379;4681.087187998308;4710.128626204163;4462.129884672458;4547.113312903952;4606.493285738633;4607.216773148506;4618.538146185355 15:24:43 INFO - PROCESS | 32632 | |1;ext.html;476.0479041916168;483.43679613250566;512.6385897941951;515.5849541119399;536.8496820890152;23279.55564665709;32399.838000809992;32772.180695482595;32812.34375312492;32891;35345.82327088361;35619.82190089052;35821.46267805978;35885.82057089711;35943.820280898624;7726.8454630907345;7881.487703299296;7918.920810791876;7926.326262267686;7930.484518506279;7738.18749031352;7825.765227043198;7839.921600783976;7849.372050235967;7883.8029049273655;7840.764777056697;7896.210378962087;7902.486338388015;7902.683892644287;7916.445848790587;7781.844363112735;7843.294103530681;7919.999999999971;8063.233992770677;8064.233897779702;7957.960210198969;8092.797680057986;8113.95943020287;8117;8135.3491720662205;36904.63095369039;37186.25627487435;37259.4411083834;37382.81308593467;37407.625923740685;2819.703931087227;2989.880404783806;3025.4554180247546;3035.256362191255;3363.3441478911377;28210.435791284264;28238.294042648893;28572;28604.284892877637;28848.134555963356;2964.614600101973;2967.9554806677916;2973.2566858285427;2990.8355040472766;2999.610050693396;158176.99999999884;159622.20188899097;160565;161716;162379;41020.1795964085;41790.164196716505;53993.1901021485;54872.45127548673;54968.45031549713;39279.41080883789;39294.60705392966;39456.40815387772;39558.20883582312;39620.801895990335;12703.745925081446;12730.872691273154;12801.487940482462;12849.486020559072;12871.099023068295;10272.948635256776;10311.329763565494;10317.071463568314;10388.844167337496;10392.42841643717;13090.476380944656;13178.934105329603;13195.934020330029;13228.735425291441;13232.536861209812;5266.868328291824;5521.751521181556;5555.0834112371;5610.242617246701;5667;832.4505826154709;847.1020718038899;859.8237361340911;929.419113054341;994.2145704893198;23276.185333513247;23359.299221023397;23823.285301440985;24618.261452156465;24905.750942490704;921.9078092190728;952.2096659772373;965.4159233663673;1024.4672770159625;1048.6015314180563;12841.93579032099;13149;13374.531891383755;13374.665633359049;13423.865761342262;296992;302247;302446;304194;305745;46622.5337746625;46656.300155497695;47093.76453117713;47103.5289647106;47342.76328618404;1183.219075410225;1216.4505780105474;1241.7702724995904;1242.6769040049653;1254.3101294288288;23739.762602373754;24679.38301542476;27566.310842229104;28415.147545573665;29466.410671786874;43416.56583434125;43836.561634383244;44104.558954410044;44171.337429939216;44197.337039943784;227164;230981;231924;232180;232553;38043;38482.61517384902;38807.80596097114;38847.805760971016;38926.2214755709;40608.1878362437;40694;40950.18099637931;41313.79343103265;41786.791066044476;35291.823540882135;35442.291154177285;35598.82200588981;35670.64329356777;35986.820065899505;34295.657043429244;34301;34410.31179376348;34706;34938.82530587331;33748.325033499685;34207.14482137867;34316.31367372588;34596;34599;30832.69167308388;32121.518177227827;32122.51816222712;32205.51691724673;32448.675513244565;22044.559108818055;22050.44873878102;22086.88956555207;22286.219982300543;22308.665370019786 15:24:43 INFO - PROCESS | 32632 | |2;jquery.html;327.012422484098;339.345064026429;339.5551827106491;340.9744269179812;343.4590519931109;14927.5521734348;14986.775198372034;15481.69036619267;15497.302621382036;15507.922460387696;13695.972802039862;13884.930575347134;14161.150330980148;14176.432942682306;14594.781078283835;4944.2089265717495;5153.484651534854;5159.690418574879;5189.169732842746;5191.896162076756;4796.83211087612;5005.799768009275;5018.222175562775;5055;5114.386273647167;5024.447310795809;5034.068697290994;5036.521530454601;5041.697498150104;5043.773030213649;5341.252224688546;5819.970900145493;5857.589968702193;5860.853478663025;5877.70611469427;5156.845294641167;5163.432022477525;5164;5165.793368265265;5169.069567477853;15618.219089045502;18206.271749130017;18237.17932693032;18334.54163645906;18463.815361846344;1793;1801.6666916620336;2176.4232478393237;2284.611616025263;2377.6195808670705;8414.990201175899;8458.407911446202;8718.302535797184;8859.645614175426;8898.555072246361;1672.5734937590837;1695.203254470397;1712.9314827406888;1744.425735246635;1818.9090545472673;45161.54838451639;49512.999999999636;49866.25200621993;54050.189247161325;57104;9019.241247956585;9418.529073546295;9732.2214222862;9771.853422198672;9889.406635601887;12313.199642023419;12339.568115115928;12393.566225182076;12398.25610463375;12425.813612795815;6675.632840193836;6689.063531105649;6785.525013249124;6795;6894.586324820527;6378.904316435257;6438.356164383524;6490.318516555788;6509.837254068686;6516.185476815398;4043.6765058795227;4128.504579450485;4169.812358443877;4191.203671302443;4211.052513184509;1681.159420289855;1753;1759.6245069156537;1765.898580688976;1766.3464518128376;804.6218277409608;853.2661910756744;869.8129902070958;935.4761333653177;947.1712251779693;14854.777178342334;15132.773008404884;15167.544973650809;15225.847741522442;15299;815.9592020398957;825.162460102996;842.3513894301353;860.1527495417009;861.1001503428931;8636.352273579507;8731.126887311219;8753.47479151253;8790.296776257885;8800.77998050041;365289;365522;365896;366374;375538;54580.45419545754;56371.71814140903;57460;57569.424305757246;58109;906.7415786500816;930.2046750028628;930.8138372325562;934.780326623243;942.2744486745305;13210.537631182862;13247;13438;13538.187708737507;13765.587032389045;30672.846635766677;31163;31204.53193202149;31251;31588.36823263568;41148.1770364597;42831.57168428276;43014;43048;43059;6845.5550389224545;6903.482238832007;6982.266861979622;7056.400205982549;7069.505134640526;7709;10014.949925250326;10516.894831051592;10671.519781609692;11244.718882027688;9205;9208.815823683623;9290.58192381331;9338.36578598756;9848.852267216142;9243.86134207974;9388.24894008464;9442.52787360643;9458.621655133993;9629.566669499749;8595.18345757152;9685.079917407835;9788.265880058882;9918.504074796376;9935.751606209902;6473.805785826433;6623.701933412912;6709.832254193684;7026.543274687129;7037.225905150532;8846.424982376126;8906.955465222632;9010.774730631787;9304.116108969638;9347.672831450867 15:24:43 INFO - PROCESS | 32632 | |3;mootools.html;1309.064019226253;1318.8549259581443;1397.6016835201963;1653.115583163008;1668.5995361113337;5495.725213739307;6600.405963463288;6652.068710380545;6873.450123990081;6881.243063263037;6696.598204107745;6700.664966751668;6707.396334329909;6715.42918851897;6775.898361524569;1972.5660354721974;1978.910949007298;2003.9699404508945;2004.1181879972837;2004.3085135628185;1940.8544359173047;1979.2775636892575;1993.3222704280543;2021.1309137071053;2034.6947957806374;1991.7609886813602;1992.292736078693;2018.3642152721845;2021.191523390641;2022.8078332558457;2021.5148364392587;2031.3499680102373;2044.1210279579775;2046;2051.5178932950744;1946.1047917957756;1973.7434133562688;1990.910409031597;1993.6411445939725;1996.7703714072923;6854.451643868479;6860.5197636165485;6917.204521479994;6924;6937.7571784987285;4021.698372622065;4114.053767633432;4119.8352065917325;4122.752634841889;4138.089620283533;2528.3679080229945;2638.300850274679;2660.4945060438454;2690.5964105384155;2694.8113632045765;768.6579472134903;781.1407451803028;785.9017622797151;800.2953708600643;803.4054799448425;8980.550972451416;8989.910100898973;8996.010438851721;8997.235235005033;9023.323250756153;3770.9434358484646;3804.9048773780323;3809.6380843819793;3859.7298189127055;3897.6297251761603;7689.038870141232;7748.883766743504;7775.105862825734;7783.104942931522;7809.687612495437;4122;4140.441040459499;4143.875683729493;4160.854370097032;4172.520160181557;3040.7567394608377;3724.7392682511963;3767.1147280389087;3769.0577355661085;3785.772853628791;3269.8038117712535;3284.1953721338423;3338.449155889251;3374.814385208788;3384.5430866833153;1059.3379138038727;1061.570064124031;1070.8607880975424;1088.6298658456005;1095.1239008792934;934.0612684252283;939.0890835889177;940.8024314893948;947.3510645208055;958.5973890965811;6014.909776353358;6060.212172417558;6085.6044357117535;6096.146539484475;6096.847578810476;421.86922054163307;433.086188143018;433.96528277737707;436.1821584529008;439.42215985978333;4775.403074615673;4815.15734746425;4875.219964805614;4878.878028049327;4889.704228379483;7557.168711441737;7802.219778022266;7808.453408261367;8131.390145738975;8165.836683266301;7586.089669239726;7732.381409487228;7763.805904852311;7766.844663106706;7802.960985195038;6161.661108639068;6198.845028874224;6257.468115210167;6265.4361107500545;6288.591241569284;6177.598456100339;6363.045543168561;6382.936170638234;6395.520335974914;6411.903821442589;7085.929140708527;7204.855902882018;7218;7333.1200255969625;7478.214787447239;6961.303869612998;7082.964585177041;7487.064116985377;7565.886511702439;7636.236376362319;5330.360356757214;6114.144019837316;6118.694065296629;6216.191895053614;6242.157308763259;6294.339094395023;6334.764720879384;6336.556441049082;6347.111404403295;6374.904376434264;5554.444555544414;5618.325800903917;5676.829695109153;5705.942940570541;5897.70511474416;5535.25274087993;5635.830925072254;5644;5764.827055188351;5778.85552861165;5679.460451257124;5969.5374633213405;6006.3693312201585;6048.971674815204;6134.325224225242;5553.944460555343;5610.270664813711;5614.803481878114;5615.101583746581;5616.775328986795;5594.104943209067;5623.3533143689;5625.943740562706;5642.830715078554;5655.1517272409465 15:24:43 INFO - PROCESS | 32632 | |4;prototype.html;286.4571636748362;298.27221579346394;299.4744223887078;306.70862680453575;306.94781887079193;5577.553795696344;5630.324361076667;5676.176954341623;5679.630823996443;5781.971090144554;5550.389457159709;5605.607607467468;5630.802921897734;5634.690092044936;5635.549156067515;4071.4503542021894;4139.7309174903685;4179.561146079664;4183.142455796555;4214.241436541429;4173.624373806357;4184.518780340254;4185.183889141618;4188.434561334211;4193.853215137471;4139.648129908946;4149.585041495857;4157.376393540962;4159.9376009359885;4159.980804702852;4155;4158.438610787535;4161.084561396503;4180.498340199165;4181.937270940938;3565.8038807865555;3582.7133829293593;3605;3606.495090687306;3617.963820361789;5299.046171689094;5317.229001794757;5332.253484512172;5336.119540275849;5338.492843179931;4604.815807367701;4751.026039661861;4802.735849528274;4805.351277577517;4811;5775.27809023872;5784;5810.012297909366;5813.418658134195;5825.679587622679;3894.941575876364;3906.785126818024;3911.5892831252595;3912.726109172359;3924.1759230561615;6072.544559158081;6149.831532008949;6153.230846144232;6153.815385538441;6154.599951003215;3997.540282867449;4000.139969906484;4004.1991601679197;4006.579309172553;4016.8393264269685;4058.9188216236103;4059.6143366380147;4062.268791617478;4066.898327541776;4079;4623.583877451046;4757.119932812441;4766.094442055998;4772.403449568804;4777.737224452619;5833.300003999547;5851.590388672752;5854;5865.472107510344;5869.383714709979;1436.490046033664;1451.4629587052648;1453.4331610671848;1454.3019350711718;1454.4981981216463;934.1545900959643;940.5297351324338;940.5720397219249;970.4177493503983;975.9557273717055;5032.421271553818;5046.142155833517;5055.140626093573;5056;5056;6043.8791224175275;6046.969765151146;6063.090536419484;6063.393660633901;6064.090386442069;4861.756912154378;5000.199968005102;5037;5048.7728052237735;5054.595632349403;3219.500977348515;3298.274379636476;3315.8176300303717;3318.070940136766;3318.7179089777155;5758.136279558016;5761.971190144022;5763.164341170507;5766.769329226868;5771.653700777967;6316.05259211122;6317.778877739257;6320.988641817379;6325.462335701517;6331.05034244867;5675.886482270332;5703.74333155009;5738.684372359477;5752.568557358215;5755.424457554211;5899.292084949833;5966.164736936746;6081.817545473643;6107.450329470369;6109.358517355614;5907.3501914790195;5931.169636251015;5945.524358051432;5960.552958528041;5961.880762384815;5704.172894930295;5712.6286791358425;5730.312362516524;5736.942630573641;5747.712614369349;4029.17401932609;4068.6338229559483;4072.490938632671;4075.3886916962692;4078.8368465261055;5905.379935106752;6040.275166979991;6042.758289668364;6058.787942421994;6096.817095487142;5692.601517893708;5873.119032145212;5873.442023007808;5881.2942446904935;5886.411358864079;5854.912176317273;5865.178874957594;5870.002099643157;5875.297363212799;5884;5691.8292451226525;5718.8848174605555;5738;5739.139129130664;5749.770009199752;5866.090755932837;5883.2057672213705;5907.054871220584;5916.526677865846;5922.378150294329;5549.1676248563035;5725.112607545837;5787.8553036174435;5795.478406943395;5799.536037116936 15:24:43 INFO - PROCESS | 32632 | |5;yui.html;698.3784431855648;699.0562740300592;705.9399951004165;707.8619669164515;709.7657772934932;10247.180225581955;11070.612528561502;11202.607908723196;11334.829977550344;11338.829917551222;10215.642452514163;12076.396180190999;12310.63068107956;12337.50649974;12343.074269429784;424.27025516112235;763.6525380951654;775.8797386405116;779.9821233290554;781.4803155901319;767.2557619109483;774.2760518914832;779.2441331908068;783.8314762326099;783.9686412543491;811.2414892075899;812.4231795425255;818.2267756969666;822.43663090783;823.8805373220879;807.2089352434617;815.5881279953645;818.6807145213371;819.0253598218102;820.6225136437216;599.2180204832691;599.3137857153534;604.1572007050185;605.5700452678603;606.9908951365688;11595.594154204562;11749.118816088741;11760.705982350424;11831.526738930519;11844.703882402922;11136.888631113667;11317.773644527064;11439.485223164978;11463.828042579285;11718.179727419085;8966.417182883091;9045.457272563668;9071.773205669844;9107.453552786854;9165.542340225327;2969.732724054824;2974.256435891027;2979.7616190704694;2997.2357048952595;3051.0694238257324;39117.804410978046;39533.209335813124;39940;40179;40649.39025914614;8568.700095496752;8574.185452382013;8598.097199793932;8636.524991125549;8652.394332396672;14784.852151478348;14880.181590012653;14914.030588011745;14999.100053996795;15187;5960.791372301948;5969.910451343233;5988.221531200916;6053.848653783691;6104.11490333908;3249.821259830732;3315.966840331566;3355.7818741781707;3416;3422.931541369159;2418.600930846426;2420.1408499982604;2431.878406079689;2436.2934748922967;2445.743196964293;454.0465023450727;455.78805855277454;469.2234352147202;469.9506551812079;470.6258524473052;429.87103868839847;452.4638303610232;483.4971629505275;554.6256277013;562.3139769481227;7481.289277518627;7539.773806785805;7573.810654733676;7642.388608911274;7646.694132234759;403.9333509970822;457.5150340638933;515.31205840203;530.6126527634771;537.3846945247748;3458.1008937676384;3522.18989632386;3586.1572530455323;3599.8380072896784;3634.3821550336506;44595.55404445979;44945.325820112725;45560.77219613947;45826.54173458223;46057;41250.79374603108;41399.379009314885;41900.790496047324;42038.36942445866;42040.579594204275;38267.808660957075;38856.61143388587;38973.415398769044;39221.2155756889;39372.80313598413;8143.348532117535;8312.127226641358;8406.831863362577;8431.747047588582;8445.817585537907;29473.263168420963;30177.09468715942;31715.84142079275;31835.36329273448;31987;36205.45691814572;36560.63439365679;37021.62978370182;37387.504499819705;37496.62503374931;9518.095780900803;9583.281253905845;9692.127708506268;9945.502724863583;9952;9938;10326.328788628714;10626.096781773636;10961.945190274317;10966.945165274123;9350.76623084401;9436.568448032487;9535.761605959906;9706;9751.3661611995;9785.951070244602;9976.750581235527;10275.434851083262;10310.07209351162;10343.120834729132;9644.614215431304;9847.212223021997;9958.850617240601;10202.948985255027;10263.640772572924;8881.555922203735;9017.95491022567;9024.954875225845;9199.034101419255;9231.307651925998;8065.717699880711;8637.740867773977;8992.325575581726;9132.178103970675;9204.125608067223 15:24:43 INFO - PROCESS | 32632 | __end_tp_report 15:24:43 INFO - PROCESS | 32632 | __start_cc_report 15:24:43 INFO - PROCESS | 32632 | _x_x_mozilla_cycle_collect,342 15:24:43 INFO - PROCESS | 32632 | __end_cc_report 15:24:43 INFO - PROCESS | 32632 | __startTimestamp1456529083718__endTimestamp 15:24:43 INFO - PROCESS | 32632 | 15:24:43 INFO - PROCESS | 32632 | ------- Summary: start ------- 15:24:43 INFO - PROCESS | 32632 | Number of tests: 6 15:24:43 INFO - PROCESS | 32632 | 15:24:43 INFO - PROCESS | 32632 | [#0] dojo.html Cycles:165 Average:4456.68 Median:4564.57 stddev:443.85 (9.7%) stddev-sans-first:420.46 15:24:43 INFO - PROCESS | 32632 | Values: 2593.7 2620.3 2652.7 2660.2 2666.6 4425.2 4480.3 4491.4 4516.3 4544.2 4512.7 4514.8 4528.6 4549.3 4582.8 4069.7 4158.5 4167.0 4289.6 4309.4 4115.7 4138.1 4172.3 4236.9 4282.9 4117.1 4126.4 4139.8 4167.1 4176.0 4149.9 4175.0 4185.3 4191.1 4208.3 4042.2 4119.3 4158.9 4202.2 4223.5 4397.3 4432.0 4432.6 4436.9 4484.5 4758.6 4786.6 4787.4 4792.3 4809.9 4854.2 4896.1 4902.1 4937.2 4939.5 4466.8 4479.6 4509.6 4518.4 4539.6 4759.4 4808.8 4949.5 4951.6 4995.9 4767.2 4770.4 4772.0 4775.1 4807.7 4691.4 4796.8 4848.5 4864.3 4891.0 4570.9 4719.5 4730.6 4747.5 4760.2 4753.8 4758.8 4761.1 4769.0 4821.1 4091.0 4101.3 4102.1 4130.7 4134.2 3481.9 3562.8 3604.3 3633.1 3646.3 4151.1 4186.2 4190.3 4220.4 4245.3 4794.9 4808.0 4830.4 4832.9 4843.1 4116.5 4125.4 4166.0 4207.2 4235.2 4321.8 4322.1 4324.8 4325.1 4333.7 4385.3 4581.8 4583.9 4598.1 4630.4 4820.6 4868.9 4879.0 4897.1 4922.8 4544.1 4564.6 4581.3 4584.5 4636.4 4626.7 4774.5 4778.2 4789.9 4807.2 4789.7 4813.8 4853.4 4857.8 4891.3 4663.4 4667.9 4674.0 4713.7 4720.2 4505.6 4651.9 4666.3 4670.5 4677.2 4472.5 4539.7 4554.5 4598.8 4624.8 4593.5 4658.2 4673.2 4681.1 4710.1 4462.1 4547.1 4606.5 4607.2 4618.5 15:24:43 INFO - PROCESS | 32632 | 15:24:43 INFO - PROCESS | 32632 | [#1] ext.html Cycles:180 Average:38862.14 Median:34822.41 stddev:62392.42 (179.2%) stddev-sans-first:62500.88 15:24:43 INFO - PROCESS | 32632 | Values: 476.0 483.4 512.6 515.6 536.8 23279.6 32399.8 32772.2 32812.3 32891.0 35345.8 35619.8 35821.5 35885.8 35943.8 7726.8 7881.5 7918.9 7926.3 7930.5 7738.2 7825.8 7839.9 7849.4 7883.8 7840.8 7896.2 7902.5 7902.7 7916.4 7781.8 7843.3 7920.0 8063.2 8064.2 7958.0 8092.8 8114.0 8117.0 8135.3 36904.6 37186.3 37259.4 37382.8 37407.6 2819.7 2989.9 3025.5 3035.3 3363.3 28210.4 28238.3 28572.0 28604.3 28848.1 2964.6 2968.0 2973.3 2990.8 2999.6 158177.0 159622.2 160565.0 161716.0 162379.0 41020.2 41790.2 53993.2 54872.5 54968.5 39279.4 39294.6 39456.4 39558.2 39620.8 12703.7 12730.9 12801.5 12849.5 12871.1 10272.9 10311.3 10317.1 10388.8 10392.4 13090.5 13178.9 13195.9 13228.7 13232.5 5266.9 5521.8 5555.1 5610.2 5667.0 832.5 847.1 859.8 929.4 994.2 23276.2 23359.3 23823.3 24618.3 24905.8 921.9 952.2 965.4 1024.5 1048.6 12841.9 13149.0 13374.5 13374.7 13423.9 296992.0 302247.0 302446.0 304194.0 305745.0 46622.5 46656.3 47093.8 47103.5 47342.8 1183.2 1216.5 1241.8 1242.7 1254.3 23739.8 24679.4 27566.3 28415.1 29466.4 43416.6 43836.6 44104.6 44171.3 44197.3 227164.0 230981.0 231924.0 232180.0 232553.0 38043.0 38482.6 38807.8 38847.8 38926.2 40608.2 40694.0 40950.2 41313.8 41786.8 35291.8 35442.3 35598.8 35670.6 35986.8 34295.7 34301.0 34410.3 34706.0 34938.8 33748.3 34207.1 34316.3 34596.0 34599.0 30832.7 32121.5 32122.5 32205.5 32448.7 22044.6 22050.4 22086.9 22286.2 22308.7 15:24:43 INFO - PROCESS | 32632 | 15:24:43 INFO - PROCESS | 32632 | [#2] jquery.html Cycles:180 Average:21606.32 Median:5161.56 stddev:60130.07 (1165.0%) stddev-sans-first:60277.52 15:24:43 INFO - PROCESS | 32632 | Values: 327.0 339.3 339.6 341.0 343.5 14927.6 14986.8 15481.7 15497.3 15507.9 13696.0 13884.9 14161.2 14176.4 14594.8 4944.2 5153.5 5159.7 5189.2 5191.9 4796.8 5005.8 5018.2 5055.0 5114.4 5024.4 5034.1 5036.5 5041.7 5043.8 5341.3 5820.0 5857.6 5860.9 5877.7 5156.8 5163.4 5164.0 5165.8 5169.1 15618.2 18206.3 18237.2 18334.5 18463.8 1793.0 1801.7 2176.4 2284.6 2377.6 8415.0 8458.4 8718.3 8859.6 8898.6 1672.6 1695.2 1712.9 1744.4 1818.9 45161.5 49513.0 49866.3 54050.2 57104.0 9019.2 9418.5 9732.2 9771.9 9889.4 12313.2 12339.6 12393.6 12398.3 12425.8 6675.6 6689.1 6785.5 6795.0 6894.6 6378.9 6438.4 6490.3 6509.8 6516.2 4043.7 4128.5 4169.8 4191.2 4211.1 1681.2 1753.0 1759.6 1765.9 1766.3 804.6 853.3 869.8 935.5 947.2 14854.8 15132.8 15167.5 15225.8 15299.0 816.0 825.2 842.4 860.2 861.1 8636.4 8731.1 8753.5 8790.3 8800.8 365289.0 365522.0 365896.0 366374.0 375538.0 54580.5 56371.7 57460.0 57569.4 58109.0 906.7 930.2 930.8 934.8 942.3 13210.5 13247.0 13438.0 13538.2 13765.6 30672.8 31163.0 31204.5 31251.0 31588.4 41148.2 42831.6 43014.0 43048.0 43059.0 6845.6 6903.5 6982.3 7056.4 7069.5 7709.0 10014.9 10516.9 10671.5 11244.7 9205.0 9208.8 9290.6 9338.4 9848.9 9243.9 9388.2 9442.5 9458.6 9629.6 8595.2 9685.1 9788.3 9918.5 9935.8 6473.8 6623.7 6709.8 7026.5 7037.2 8846.4 8907.0 9010.8 9304.1 9347.7 15:24:43 INFO - PROCESS | 32632 | 15:24:43 INFO - PROCESS | 32632 | [#3] mootools.html Cycles:180 Average:4664.07 Median:5649.58 stddev:2401.37 (42.5%) stddev-sans-first:2394.87 15:24:43 INFO - PROCESS | 32632 | Values: 1309.1 1318.9 1397.6 1653.1 1668.6 5495.7 6600.4 6652.1 6873.5 6881.2 6696.6 6700.7 6707.4 6715.4 6775.9 1972.6 1978.9 2004.0 2004.1 2004.3 1940.9 1979.3 1993.3 2021.1 2034.7 1991.8 1992.3 2018.4 2021.2 2022.8 2021.5 2031.3 2044.1 2046.0 2051.5 1946.1 1973.7 1990.9 1993.6 1996.8 6854.5 6860.5 6917.2 6924.0 6937.8 4021.7 4114.1 4119.8 4122.8 4138.1 2528.4 2638.3 2660.5 2690.6 2694.8 768.7 781.1 785.9 800.3 803.4 8980.6 8989.9 8996.0 8997.2 9023.3 3770.9 3804.9 3809.6 3859.7 3897.6 7689.0 7748.9 7775.1 7783.1 7809.7 4122.0 4140.4 4143.9 4160.9 4172.5 3040.8 3724.7 3767.1 3769.1 3785.8 3269.8 3284.2 3338.4 3374.8 3384.5 1059.3 1061.6 1070.9 1088.6 1095.1 934.1 939.1 940.8 947.4 958.6 6014.9 6060.2 6085.6 6096.1 6096.8 421.9 433.1 434.0 436.2 439.4 4775.4 4815.2 4875.2 4878.9 4889.7 7557.2 7802.2 7808.5 8131.4 8165.8 7586.1 7732.4 7763.8 7766.8 7803.0 6161.7 6198.8 6257.5 6265.4 6288.6 6177.6 6363.0 6382.9 6395.5 6411.9 7085.9 7204.9 7218.0 7333.1 7478.2 6961.3 7083.0 7487.1 7565.9 7636.2 5330.4 6114.1 6118.7 6216.2 6242.2 6294.3 6334.8 6336.6 6347.1 6374.9 5554.4 5618.3 5676.8 5705.9 5897.7 5535.3 5635.8 5644.0 5764.8 5778.9 5679.5 5969.5 6006.4 6049.0 6134.3 5553.9 5610.3 5614.8 5615.1 5616.8 5594.1 5623.4 5625.9 5642.8 5655.2 15:24:43 INFO - PROCESS | 32632 | 15:24:43 INFO - PROCESS | 32632 | [#4] prototype.html Cycles:180 Average:4803.04 Median:5632.75 stddev:1456.11 (25.9%) stddev-sans-first:1420.18 15:24:43 INFO - PROCESS | 32632 | Values: 286.5 298.3 299.5 306.7 306.9 5577.6 5630.3 5676.2 5679.6 5782.0 5550.4 5605.6 5630.8 5634.7 5635.5 4071.5 4139.7 4179.6 4183.1 4214.2 4173.6 4184.5 4185.2 4188.4 4193.9 4139.6 4149.6 4157.4 4159.9 4160.0 4155.0 4158.4 4161.1 4180.5 4181.9 3565.8 3582.7 3605.0 3606.5 3618.0 5299.0 5317.2 5332.3 5336.1 5338.5 4604.8 4751.0 4802.7 4805.4 4811.0 5775.3 5784.0 5810.0 5813.4 5825.7 3894.9 3906.8 3911.6 3912.7 3924.2 6072.5 6149.8 6153.2 6153.8 6154.6 3997.5 4000.1 4004.2 4006.6 4016.8 4058.9 4059.6 4062.3 4066.9 4079.0 4623.6 4757.1 4766.1 4772.4 4777.7 5833.3 5851.6 5854.0 5865.5 5869.4 1436.5 1451.5 1453.4 1454.3 1454.5 934.2 940.5 940.6 970.4 976.0 5032.4 5046.1 5055.1 5056.0 5056.0 6043.9 6047.0 6063.1 6063.4 6064.1 4861.8 5000.2 5037.0 5048.8 5054.6 3219.5 3298.3 3315.8 3318.1 3318.7 5758.1 5762.0 5763.2 5766.8 5771.7 6316.1 6317.8 6321.0 6325.5 6331.1 5675.9 5703.7 5738.7 5752.6 5755.4 5899.3 5966.2 6081.8 6107.5 6109.4 5907.4 5931.2 5945.5 5960.6 5961.9 5704.2 5712.6 5730.3 5736.9 5747.7 4029.2 4068.6 4072.5 4075.4 4078.8 5905.4 6040.3 6042.8 6058.8 6096.8 5692.6 5873.1 5873.4 5881.3 5886.4 5854.9 5865.2 5870.0 5875.3 5884.0 5691.8 5718.9 5738.0 5739.1 5749.8 5866.1 5883.2 5907.1 5916.5 5922.4 5549.2 5725.1 5787.9 5795.5 5799.5 15:24:43 INFO - PROCESS | 32632 | 15:24:43 INFO - PROCESS | 32632 | [#5] yui.html Cycles:180 Average:11683.96 Median:23263.11 stddev:13055.96 (56.1%) stddev-sans-first:13066.52 15:24:43 INFO - PROCESS | 32632 | Values: 698.4 699.1 705.9 707.9 709.8 10247.2 11070.6 11202.6 11334.8 11338.8 10215.6 12076.4 12310.6 12337.5 12343.1 424.3 763.7 775.9 780.0 781.5 767.3 774.3 779.2 783.8 784.0 811.2 812.4 818.2 822.4 823.9 807.2 815.6 818.7 819.0 820.6 599.2 599.3 604.2 605.6 607.0 11595.6 11749.1 11760.7 11831.5 11844.7 11136.9 11317.8 11439.5 11463.8 11718.2 8966.4 9045.5 9071.8 9107.5 9165.5 2969.7 2974.3 2979.8 2997.2 3051.1 39117.8 39533.2 39940.0 40179.0 40649.4 8568.7 8574.2 8598.1 8636.5 8652.4 14784.9 14880.2 14914.0 14999.1 15187.0 5960.8 5969.9 5988.2 6053.8 6104.1 3249.8 3316.0 3355.8 3416.0 3422.9 2418.6 2420.1 2431.9 2436.3 2445.7 454.0 455.8 469.2 470.0 470.6 429.9 452.5 483.5 554.6 562.3 7481.3 7539.8 7573.8 7642.4 7646.7 403.9 457.5 515.3 530.6 537.4 3458.1 3522.2 3586.2 3599.8 3634.4 44595.6 44945.3 45560.8 45826.5 46057.0 41250.8 41399.4 41900.8 42038.4 42040.6 38267.8 38856.6 38973.4 39221.2 39372.8 8143.3 8312.1 8406.8 8431.7 8445.8 29473.3 30177.1 31715.8 31835.4 31987.0 36205.5 36560.6 37021.6 37387.5 37496.6 9518.1 9583.3 9692.1 9945.5 9952.0 9938.0 10326.3 10626.1 10961.9 10966.9 9350.8 9436.6 9535.8 9706.0 9751.4 9786.0 9976.8 10275.4 10310.1 10343.1 9644.6 9847.2 9958.9 10202.9 10263.6 8881.6 9018.0 9025.0 9199.0 9231.3 8065.7 8637.7 8992.3 9132.2 9204.1 15:24:43 INFO - PROCESS | 32632 | -------- Summary: end -------- 15:24:43 INFO - PROCESS | 32632 | 15:24:43 INFO - PROCESS | 32632 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:43 INFO - PROCESS | 32632 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:43 INFO - PROCESS | 32632 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:43 INFO - PROCESS | 32632 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:43 INFO - PROCESS | 32632 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:43 INFO - PROCESS | 32632 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:43 INFO - PROCESS | 32632 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:43 INFO - PROCESS | 32632 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:44 INFO - TEST-INFO | 32632: exit 0 15:24:44 INFO - TEST-OK | dromaeo_css | took 1114138ms 15:24:44 INFO - TEST-START | kraken 15:24:44 INFO - operating with platform_type : linux_ 15:24:44 INFO - Initialising browser for kraken test... 15:24:44 INFO - TEST-INFO | started process 401 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmptAKGxt/profile http://localhost:53043/getInfo.html) 15:24:48 INFO - PROCESS | 401 | 15:24:48 INFO - PROCESS | 401 | (process:473): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 15:24:49 INFO - PROCESS | 401 | __metrics Screen width/height:1600/1200 15:24:49 INFO - PROCESS | 401 | colorDepth:24 15:24:49 INFO - PROCESS | 401 | Browser inner width/height: 1024/697 15:24:49 INFO - PROCESS | 401 | __metrics 15:24:50 ERROR - PROCESS | 401 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 15:24:50 INFO - PROCESS | 401 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:50 INFO - PROCESS | 401 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:50 INFO - PROCESS | 401 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:50 INFO - PROCESS | 401 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:50 INFO - PROCESS | 401 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:50 INFO - PROCESS | 401 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:50 INFO - PROCESS | 401 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:50 INFO - PROCESS | 401 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:50 INFO - PROCESS | 401 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:24:51 INFO - TEST-INFO | 401: exit 0 15:24:51 INFO - Browser initialized. 15:24:51 INFO - Running cycle 1/1 for kraken test... 15:24:51 INFO - TEST-INFO | started process 524 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmptAKGxt/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 15:24:52 INFO - PROCESS | 524 | 15:24:52 INFO - PROCESS | 524 | (process:581): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 15:25:03 INFO - PROCESS | 524 | RSS: Main: 158785536 15:25:03 INFO - PROCESS | 524 | 15:25:05 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:53043/tests/kraken/driver.html?testName=audio-beat-detection) 15:25:06 INFO - PROCESS | 524 | RSS: Main: 164323328 15:25:06 INFO - PROCESS | 524 | 15:25:09 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:53043/tests/kraken/driver.html?testName=audio-dft) 15:25:09 INFO - PROCESS | 524 | RSS: Main: 166809600 15:25:09 INFO - PROCESS | 524 | 15:25:12 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:53043/tests/kraken/driver.html?testName=audio-fft) 15:25:13 INFO - PROCESS | 524 | RSS: Main: 161468416 15:25:13 INFO - PROCESS | 524 | 15:25:15 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:53043/tests/kraken/driver.html?testName=audio-oscillator) 15:25:15 INFO - PROCESS | 524 | RSS: Main: 161972224 15:25:15 INFO - PROCESS | 524 | 15:25:18 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:53043/tests/kraken/driver.html?testName=imaging-gaussian-blur) 15:25:18 INFO - PROCESS | 524 | RSS: Main: 162521088 15:25:18 INFO - PROCESS | 524 | 15:25:21 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:53043/tests/kraken/driver.html?testName=imaging-darkroom) 15:25:22 INFO - PROCESS | 524 | RSS: Main: 160854016 15:25:22 INFO - PROCESS | 524 | 15:25:26 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:53043/tests/kraken/driver.html?testName=imaging-desaturate) 15:25:26 INFO - PROCESS | 524 | RSS: Main: 161284096 15:25:26 INFO - PROCESS | 524 | 15:25:29 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:53043/tests/kraken/driver.html?testName=json-parse-financial) 15:25:30 INFO - PROCESS | 524 | RSS: Main: 161071104 15:25:30 INFO - PROCESS | 524 | 15:25:31 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:53043/tests/kraken/driver.html?testName=json-stringify-tinderbox) 15:25:32 INFO - PROCESS | 524 | RSS: Main: 162897920 15:25:32 INFO - PROCESS | 524 | 15:25:34 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:53043/tests/kraken/driver.html?testName=stanford-crypto-aes) 15:25:34 INFO - PROCESS | 524 | RSS: Main: 163225600 15:25:34 INFO - PROCESS | 524 | 15:25:37 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:53043/tests/kraken/driver.html?testName=stanford-crypto-ccm) 15:25:37 INFO - PROCESS | 524 | RSS: Main: 161808384 15:25:37 INFO - PROCESS | 524 | 15:25:40 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:53043/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 15:25:40 INFO - PROCESS | 524 | RSS: Main: 161665024 15:25:40 INFO - PROCESS | 524 | 15:25:43 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:53043/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 15:25:44 INFO - PROCESS | 524 | RSS: Main: 163651584 15:25:44 INFO - PROCESS | 524 | 15:25:45 INFO - PROCESS | 524 | Cycle 1(1): loaded http://localhost:53043/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:53043/tests/kraken/driver.html?testName=ai-astar) 15:25:46 INFO - PROCESS | 524 | RSS: Main: 163041280 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | __start_tp_report 15:25:46 INFO - PROCESS | 524 | _x_x_mozilla_page_load 15:25:46 INFO - PROCESS | 524 | _x_x_mozilla_page_load_details 15:25:46 INFO - PROCESS | 524 | |i|pagename|runs| 15:25:46 INFO - PROCESS | 524 | |0;ai-astar;117;113;115;114;115;128;115;115;115;114 15:25:46 INFO - PROCESS | 524 | |1;audio-beat-detection;162;134;157;174;135;159;162;145;176;136 15:25:46 INFO - PROCESS | 524 | |2;audio-dft;164;165;165;161;165;169;167;166;168;165 15:25:46 INFO - PROCESS | 524 | |3;audio-fft;74;75;74;76;73;140;75;73;73;73 15:25:46 INFO - PROCESS | 524 | |4;audio-oscillator;99;99;138;98;98;99;143;98;98;141 15:25:46 INFO - PROCESS | 524 | |5;imaging-gaussian-blur;120;115;115;115;116;116;116;116;115;116 15:25:46 INFO - PROCESS | 524 | |6;imaging-darkroom;148;149;152;148;148;148;147;148;149;149 15:25:46 INFO - PROCESS | 524 | |7;imaging-desaturate;96;96;97;97;96;97;97;97;96;96 15:25:46 INFO - PROCESS | 524 | |8;json-parse-financial;69;68;69;68;68;68;68;75;68;67 15:25:46 INFO - PROCESS | 524 | |9;json-stringify-tinderbox;69;73;69;71;70;71;70;71;70;71 15:25:46 INFO - PROCESS | 524 | |10;stanford-crypto-aes;84;84;92;84;86;87;85;93;86;85 15:25:46 INFO - PROCESS | 524 | |11;stanford-crypto-ccm;128;137;129;128;123;121;122;133;132;134 15:25:46 INFO - PROCESS | 524 | |12;stanford-crypto-pbkdf2;140;152;155;160;152;142;151;155;153;139 15:25:46 INFO - PROCESS | 524 | |13;stanford-crypto-sha256-iterative;72;75;73;71;76;71;75;74;73;71 15:25:46 INFO - PROCESS | 524 | __end_tp_report 15:25:46 INFO - PROCESS | 524 | __start_cc_report 15:25:46 INFO - PROCESS | 524 | _x_x_mozilla_cycle_collect,848 15:25:46 INFO - PROCESS | 524 | __end_cc_report 15:25:46 INFO - PROCESS | 524 | __startTimestamp1456529146191__endTimestamp 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | ------- Summary: start ------- 15:25:46 INFO - PROCESS | 524 | Number of tests: 14 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#0] ai-astar Cycles:10 Average:116.10 Median:115.00 stddev:4.31 (3.7%) stddev-sans-first:4.56 15:25:46 INFO - PROCESS | 524 | Values: 117.0 113.0 115.0 114.0 115.0 128.0 115.0 115.0 115.0 114.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#1] audio-beat-detection Cycles:10 Average:154.00 Median:160.50 stddev:15.68 (9.8%) stddev-sans-first:16.36 15:25:46 INFO - PROCESS | 524 | Values: 162.0 134.0 157.0 174.0 135.0 159.0 162.0 145.0 176.0 136.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#2] audio-dft Cycles:10 Average:165.50 Median:165.50 stddev:2.22 (1.3%) stddev-sans-first:2.29 15:25:46 INFO - PROCESS | 524 | Values: 164.0 165.0 165.0 161.0 165.0 169.0 167.0 166.0 168.0 165.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#3] audio-fft Cycles:10 Average:80.60 Median:74.00 stddev:20.90 (28.2%) stddev-sans-first:22.03 15:25:46 INFO - PROCESS | 524 | Values: 74.0 75.0 74.0 76.0 73.0 140.0 75.0 73.0 73.0 73.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#4] audio-oscillator Cycles:10 Average:111.10 Median:98.00 stddev:20.44 (20.9%) stddev-sans-first:21.21 15:25:46 INFO - PROCESS | 524 | Values: 99.0 99.0 138.0 98.0 98.0 99.0 143.0 98.0 98.0 141.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#5] imaging-gaussian-blur Cycles:10 Average:116.00 Median:116.00 stddev:1.49 (1.3%) stddev-sans-first:0.53 15:25:46 INFO - PROCESS | 524 | Values: 120.0 115.0 115.0 115.0 116.0 116.0 116.0 116.0 115.0 116.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#6] imaging-darkroom Cycles:10 Average:148.60 Median:148.50 stddev:1.35 (0.9%) stddev-sans-first:1.41 15:25:46 INFO - PROCESS | 524 | Values: 148.0 149.0 152.0 148.0 148.0 148.0 147.0 148.0 149.0 149.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#7] imaging-desaturate Cycles:10 Average:96.50 Median:97.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 15:25:46 INFO - PROCESS | 524 | Values: 96.0 96.0 97.0 97.0 96.0 97.0 97.0 97.0 96.0 96.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#8] json-parse-financial Cycles:10 Average:68.80 Median:68.00 stddev:2.25 (3.3%) stddev-sans-first:2.39 15:25:46 INFO - PROCESS | 524 | Values: 69.0 68.0 69.0 68.0 68.0 68.0 68.0 75.0 68.0 67.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#9] json-stringify-tinderbox Cycles:10 Average:70.50 Median:71.00 stddev:1.18 (1.7%) stddev-sans-first:1.12 15:25:46 INFO - PROCESS | 524 | Values: 69.0 73.0 69.0 71.0 70.0 71.0 70.0 71.0 70.0 71.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#10] stanford-crypto-aes Cycles:10 Average:86.60 Median:86.00 stddev:3.27 (3.8%) stddev-sans-first:3.33 15:25:46 INFO - PROCESS | 524 | Values: 84.0 84.0 92.0 84.0 86.0 87.0 85.0 93.0 86.0 85.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#11] stanford-crypto-ccm Cycles:10 Average:128.70 Median:130.50 stddev:5.42 (4.2%) stddev-sans-first:5.74 15:25:46 INFO - PROCESS | 524 | Values: 128.0 137.0 129.0 128.0 123.0 121.0 122.0 133.0 132.0 134.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:149.90 Median:152.50 stddev:7.09 (4.7%) stddev-sans-first:6.56 15:25:46 INFO - PROCESS | 524 | Values: 140.0 152.0 155.0 160.0 152.0 142.0 151.0 155.0 153.0 139.0 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:73.10 Median:73.50 stddev:1.85 (2.5%) stddev-sans-first:1.92 15:25:46 INFO - PROCESS | 524 | Values: 72.0 75.0 73.0 71.0 76.0 71.0 75.0 74.0 73.0 71.0 15:25:46 INFO - PROCESS | 524 | -------- Summary: end -------- 15:25:46 INFO - PROCESS | 524 | 15:25:46 INFO - PROCESS | 524 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:25:46 INFO - PROCESS | 524 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:25:46 INFO - PROCESS | 524 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:25:46 INFO - PROCESS | 524 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:25:46 INFO - PROCESS | 524 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 15:25:47 INFO - TEST-INFO | 524: exit 0 15:25:47 INFO - TEST-OK | kraken | took 62724ms 15:25:47 INFO - SUITE-END | took 1176s 15:25:47 INFO - Completed test suite (00:19:37) 15:25:47 INFO - Working with test: dromaeo_css 15:25:47 INFO - Generating results file: dromaeo_css 15:25:47 INFO - Working with test: kraken 15:25:47 INFO - Generating results file: kraken 15:25:47 INFO - javascript benchmark 15:25:47 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 15:25:47 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,132,43]] 15:25:47 INFO - process_Request line: dromaeo_css 6030.19 graph.html#tests=[[72,132,43]] 15:25:47 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 15:25:47 INFO - process_Request line: kraken 1566.00 graph.html#tests=[[232,132,43]] 15:25:47 INFO - RETURN: dromaeo_css: 6030.19 15:25:47 INFO - RETURN: kraken: 1566.00 15:25:47 INFO - javascript benchmark 15:25:47 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2593.7017243017053, 2620.3056190109637, 2652.708202097769, 2660.201939418174, 2666.5866790647447, 4425.203463376591, 4480.283154695246, 4491.438570178728, 4516.254817955041, 4544.227481328174, 4512.706674066183, 4514.841980530682, 4528.592426681598, 4549.272116461367, 4582.816687332503, 4069.674426045917, 4158.4594002779595, 4166.9791651041705, 4289.613934745872, 4309.4397728295435, 4115.670746340301, 4138.1103062841485, 4172.290710579194, 4236.9364459533135, 4282.850100246492, 4117.114820313617, 4126.360414135784, 4139.834406623761, 4167.1040726244, 4175.97912010438, 4149.854755083587, 4175.0, 4185.267578173807, 4191.11986482839, 4208.3266677331785, 4042.15114825884, 4119.340905455113, 4158.896027599304, 4202.201581699467, 4223.450951376301, 4397.340398940185, 4431.955680443187, 4432.645388368923, 4436.911261774746, 4484.506704262529, 4758.643101767381, 4786.593139583139, 4787.40157480315, 4792.329073929653, 4809.879753006167, 4854.223324268136, 4896.1186986342445, 4902.093112774148, 4937.185364414867, 4939.456659767423, 4466.754328511963, 4479.552044795527, 4509.594136527729, 4518.367428560005, 4539.614132798749, 4759.38128043359, 4808.831690890802, 4949.455559888409, 4951.628627852925, 4995.925061124086, 4767.237242041326, 4770.403699537558, 4772.045590881838, 4775.068861572029, 4807.687500312469, 4691.413573303337, 4796.8081276749235, 4848.515148485194, 4864.294677271847, 4890.951090489049, 4570.88572785683, 4719.528047195253, 4730.645201609893, 4747.501512341223, 4760.214564596803, 4753.809847606126, 4758.8340856489685, 4761.142994261067, 4769.046190761862, 4821.132196204647, 4090.959090409058, 4101.282275601818, 4102.077032667626, 4130.731502452331, 4134.235166494208, 3481.9477707834403, 3562.750607457453, 3604.2611264690677, 3633.091727068233, 3646.2707458507875, 4151.14901445203, 4186.246475634415, 4190.28765109932, 4220.388043733703, 4245.320748680197, 4794.87320479687, 4807.95192048082, 4830.372051633265, 4832.9275060874115, 4843.128236917389, 4116.526599441103, 4125.422440858282, 4166.041810383568, 4207.242696314693, 4235.237657221668, 4321.827126914888, 4322.113966636832, 4324.805383757675, 4325.134973005412, 4333.696641235147, 4385.342198670225, 4581.816727330936, 4583.908321833612, 4598.080383923162, 4630.374899388674, 4820.566149046603, 4868.90262194747, 4879.04858552593, 4897.069556784342, 4922.803087876445, 4544.136614043321, 4564.566366195206, 4581.312803079565, 4584.495705472462, 4636.44362676481, 4626.699264547794, 4774.4509381421585, 4778.235482322812, 4789.8504358952905, 4807.230843065093, 4789.664723469463, 4813.7593120343145, 4853.39332583427, 4857.805687772591, 4891.339669144762, 4663.440387153563, 4667.906641867075, 4674.041821426531, 4713.740744259098, 4720.150372932905, 4505.594496495331, 4651.86044418668, 4666.2767271073035, 4670.486246512813, 4677.204875171297, 4472.485664148665, 4539.659525535532, 4554.453465584151, 4598.839040633696, 4624.7687615618415, 4593.5194994703825, 4658.184817656828, 4673.158831410379, 4681.087187998308, 4710.128626204163, 4462.129884672458, 4547.113312903952, 4606.493285738633, 4607.216773148506, 4618.538146185355], "unit": "score", "name": "dojo.html", "value": 4430.380035560425}, {"lowerIsBetter": false, "replicates": [476.0479041916168, 483.43679613250566, 512.6385897941951, 515.5849541119399, 536.8496820890152, 23279.55564665709, 32399.838000809992, 32772.180695482595, 32812.34375312492, 32891.0, 35345.82327088361, 35619.82190089052, 35821.46267805978, 35885.82057089711, 35943.820280898624, 7726.8454630907345, 7881.487703299296, 7918.920810791876, 7926.326262267686, 7930.484518506279, 7738.18749031352, 7825.765227043198, 7839.921600783976, 7849.372050235967, 7883.8029049273655, 7840.764777056697, 7896.210378962087, 7902.486338388015, 7902.683892644287, 7916.445848790587, 7781.844363112735, 7843.294103530681, 7919.999999999971, 8063.233992770677, 8064.233897779702, 7957.960210198969, 8092.797680057986, 8113.95943020287, 8117.0, 8135.3491720662205, 36904.63095369039, 37186.25627487435, 37259.4411083834, 37382.81308593467, 37407.625923740685, 2819.703931087227, 2989.880404783806, 3025.4554180247546, 3035.256362191255, 3363.3441478911377, 28210.435791284264, 28238.294042648893, 28572.0, 28604.284892877637, 28848.134555963356, 2964.614600101973, 2967.9554806677916, 2973.2566858285427, 2990.8355040472766, 2999.610050693396, 158176.99999999884, 159622.20188899097, 160565.0, 161716.0, 162379.0, 41020.1795964085, 41790.164196716505, 53993.1901021485, 54872.45127548673, 54968.45031549713, 39279.41080883789, 39294.60705392966, 39456.40815387772, 39558.20883582312, 39620.801895990335, 12703.745925081446, 12730.872691273154, 12801.487940482462, 12849.486020559072, 12871.099023068295, 10272.948635256776, 10311.329763565494, 10317.071463568314, 10388.844167337496, 10392.42841643717, 13090.476380944656, 13178.934105329603, 13195.934020330029, 13228.735425291441, 13232.536861209812, 5266.868328291824, 5521.751521181556, 5555.0834112371, 5610.242617246701, 5667.0, 832.4505826154709, 847.1020718038899, 859.8237361340911, 929.419113054341, 994.2145704893198, 23276.185333513247, 23359.299221023397, 23823.285301440985, 24618.261452156465, 24905.750942490704, 921.9078092190728, 952.2096659772373, 965.4159233663673, 1024.4672770159625, 1048.6015314180563, 12841.93579032099, 13149.0, 13374.531891383755, 13374.665633359049, 13423.865761342262, 296992.0, 302247.0, 302446.0, 304194.0, 305745.0, 46622.5337746625, 46656.300155497695, 47093.76453117713, 47103.5289647106, 47342.76328618404, 1183.219075410225, 1216.4505780105474, 1241.7702724995904, 1242.6769040049653, 1254.3101294288288, 23739.762602373754, 24679.38301542476, 27566.310842229104, 28415.147545573665, 29466.410671786874, 43416.56583434125, 43836.561634383244, 44104.558954410044, 44171.337429939216, 44197.337039943784, 227164.0, 230981.0, 231924.0, 232180.0, 232553.0, 38043.0, 38482.61517384902, 38807.80596097114, 38847.805760971016, 38926.2214755709, 40608.1878362437, 40694.0, 40950.18099637931, 41313.79343103265, 41786.791066044476, 35291.823540882135, 35442.291154177285, 35598.82200588981, 35670.64329356777, 35986.820065899505, 34295.657043429244, 34301.0, 34410.31179376348, 34706.0, 34938.82530587331, 33748.325033499685, 34207.14482137867, 34316.31367372588, 34596.0, 34599.0, 30832.69167308388, 32121.518177227827, 32122.51816222712, 32205.51691724673, 32448.675513244565, 22044.559108818055, 22050.44873878102, 22086.88956555207, 22286.219982300543, 22308.665370019786], "unit": "score", "name": "ext.html", "value": 16154.63935719916}, {"lowerIsBetter": false, "replicates": [327.012422484098, 339.345064026429, 339.5551827106491, 340.9744269179812, 343.4590519931109, 14927.5521734348, 14986.775198372034, 15481.69036619267, 15497.302621382036, 15507.922460387696, 13695.972802039862, 13884.930575347134, 14161.150330980148, 14176.432942682306, 14594.781078283835, 4944.2089265717495, 5153.484651534854, 5159.690418574879, 5189.169732842746, 5191.896162076756, 4796.83211087612, 5005.799768009275, 5018.222175562775, 5055.0, 5114.386273647167, 5024.447310795809, 5034.068697290994, 5036.521530454601, 5041.697498150104, 5043.773030213649, 5341.252224688546, 5819.970900145493, 5857.589968702193, 5860.853478663025, 5877.70611469427, 5156.845294641167, 5163.432022477525, 5164.0, 5165.793368265265, 5169.069567477853, 15618.219089045502, 18206.271749130017, 18237.17932693032, 18334.54163645906, 18463.815361846344, 1793.0, 1801.6666916620336, 2176.4232478393237, 2284.611616025263, 2377.6195808670705, 8414.990201175899, 8458.407911446202, 8718.302535797184, 8859.645614175426, 8898.555072246361, 1672.5734937590837, 1695.203254470397, 1712.9314827406888, 1744.425735246635, 1818.9090545472673, 45161.54838451639, 49512.999999999636, 49866.25200621993, 54050.189247161325, 57104.0, 9019.241247956585, 9418.529073546295, 9732.2214222862, 9771.853422198672, 9889.406635601887, 12313.199642023419, 12339.568115115928, 12393.566225182076, 12398.25610463375, 12425.813612795815, 6675.632840193836, 6689.063531105649, 6785.525013249124, 6795.0, 6894.586324820527, 6378.904316435257, 6438.356164383524, 6490.318516555788, 6509.837254068686, 6516.185476815398, 4043.6765058795227, 4128.504579450485, 4169.812358443877, 4191.203671302443, 4211.052513184509, 1681.159420289855, 1753.0, 1759.6245069156537, 1765.898580688976, 1766.3464518128376, 804.6218277409608, 853.2661910756744, 869.8129902070958, 935.4761333653177, 947.1712251779693, 14854.777178342334, 15132.773008404884, 15167.544973650809, 15225.847741522442, 15299.0, 815.9592020398957, 825.162460102996, 842.3513894301353, 860.1527495417009, 861.1001503428931, 8636.352273579507, 8731.126887311219, 8753.47479151253, 8790.296776257885, 8800.77998050041, 365289.0, 365522.0, 365896.0, 366374.0, 375538.0, 54580.45419545754, 56371.71814140903, 57460.0, 57569.424305757246, 58109.0, 906.7415786500816, 930.2046750028628, 930.8138372325562, 934.780326623243, 942.2744486745305, 13210.537631182862, 13247.0, 13438.0, 13538.187708737507, 13765.587032389045, 30672.846635766677, 31163.0, 31204.53193202149, 31251.0, 31588.36823263568, 41148.1770364597, 42831.57168428276, 43014.0, 43048.0, 43059.0, 6845.5550389224545, 6903.482238832007, 6982.266861979622, 7056.400205982549, 7069.505134640526, 7709.0, 10014.949925250326, 10516.894831051592, 10671.519781609692, 11244.718882027688, 9205.0, 9208.815823683623, 9290.58192381331, 9338.36578598756, 9848.852267216142, 9243.86134207974, 9388.24894008464, 9442.52787360643, 9458.621655133993, 9629.566669499749, 8595.18345757152, 9685.079917407835, 9788.265880058882, 9918.504074796376, 9935.751606209902, 6473.805785826433, 6623.701933412912, 6709.832254193684, 7026.543274687129, 7037.225905150532, 8846.424982376126, 8906.955465222632, 9010.774730631787, 9304.116108969638, 9347.672831450867], "unit": "score", "name": "jquery.html", "value": 7532.835800361103}, {"lowerIsBetter": false, "replicates": [1309.064019226253, 1318.8549259581443, 1397.6016835201963, 1653.115583163008, 1668.5995361113337, 5495.725213739307, 6600.405963463288, 6652.068710380545, 6873.450123990081, 6881.243063263037, 6696.598204107745, 6700.664966751668, 6707.396334329909, 6715.42918851897, 6775.898361524569, 1972.5660354721974, 1978.910949007298, 2003.9699404508945, 2004.1181879972837, 2004.3085135628185, 1940.8544359173047, 1979.2775636892575, 1993.3222704280543, 2021.1309137071053, 2034.6947957806374, 1991.7609886813602, 1992.292736078693, 2018.3642152721845, 2021.191523390641, 2022.8078332558457, 2021.5148364392587, 2031.3499680102373, 2044.1210279579775, 2046.0, 2051.5178932950744, 1946.1047917957756, 1973.7434133562688, 1990.910409031597, 1993.6411445939725, 1996.7703714072923, 6854.451643868479, 6860.5197636165485, 6917.204521479994, 6924.0, 6937.7571784987285, 4021.698372622065, 4114.053767633432, 4119.8352065917325, 4122.752634841889, 4138.089620283533, 2528.3679080229945, 2638.300850274679, 2660.4945060438454, 2690.5964105384155, 2694.8113632045765, 768.6579472134903, 781.1407451803028, 785.9017622797151, 800.2953708600643, 803.4054799448425, 8980.550972451416, 8989.910100898973, 8996.010438851721, 8997.235235005033, 9023.323250756153, 3770.9434358484646, 3804.9048773780323, 3809.6380843819793, 3859.7298189127055, 3897.6297251761603, 7689.038870141232, 7748.883766743504, 7775.105862825734, 7783.104942931522, 7809.687612495437, 4122.0, 4140.441040459499, 4143.875683729493, 4160.854370097032, 4172.520160181557, 3040.7567394608377, 3724.7392682511963, 3767.1147280389087, 3769.0577355661085, 3785.772853628791, 3269.8038117712535, 3284.1953721338423, 3338.449155889251, 3374.814385208788, 3384.5430866833153, 1059.3379138038727, 1061.570064124031, 1070.8607880975424, 1088.6298658456005, 1095.1239008792934, 934.0612684252283, 939.0890835889177, 940.8024314893948, 947.3510645208055, 958.5973890965811, 6014.909776353358, 6060.212172417558, 6085.6044357117535, 6096.146539484475, 6096.847578810476, 421.86922054163307, 433.086188143018, 433.96528277737707, 436.1821584529008, 439.42215985978333, 4775.403074615673, 4815.15734746425, 4875.219964805614, 4878.878028049327, 4889.704228379483, 7557.168711441737, 7802.219778022266, 7808.453408261367, 8131.390145738975, 8165.836683266301, 7586.089669239726, 7732.381409487228, 7763.805904852311, 7766.844663106706, 7802.960985195038, 6161.661108639068, 6198.845028874224, 6257.468115210167, 6265.4361107500545, 6288.591241569284, 6177.598456100339, 6363.045543168561, 6382.936170638234, 6395.520335974914, 6411.903821442589, 7085.929140708527, 7204.855902882018, 7218.0, 7333.1200255969625, 7478.214787447239, 6961.303869612998, 7082.964585177041, 7487.064116985377, 7565.886511702439, 7636.236376362319, 5330.360356757214, 6114.144019837316, 6118.694065296629, 6216.191895053614, 6242.157308763259, 6294.339094395023, 6334.764720879384, 6336.556441049082, 6347.111404403295, 6374.904376434264, 5554.444555544414, 5618.325800903917, 5676.829695109153, 5705.942940570541, 5897.70511474416, 5535.25274087993, 5635.830925072254, 5644.0, 5764.827055188351, 5778.85552861165, 5679.460451257124, 5969.5374633213405, 6006.3693312201585, 6048.971674815204, 6134.325224225242, 5553.944460555343, 5610.270664813711, 5614.803481878114, 5615.101583746581, 5616.775328986795, 5594.104943209067, 5623.3533143689, 5625.943740562706, 5642.830715078554, 5655.1517272409465], "unit": "score", "name": "mootools.html", "value": 3782.2505614763863}, {"lowerIsBetter": false, "replicates": [286.4571636748362, 298.27221579346394, 299.4744223887078, 306.70862680453575, 306.94781887079193, 5577.553795696344, 5630.324361076667, 5676.176954341623, 5679.630823996443, 5781.971090144554, 5550.389457159709, 5605.607607467468, 5630.802921897734, 5634.690092044936, 5635.549156067515, 4071.4503542021894, 4139.7309174903685, 4179.561146079664, 4183.142455796555, 4214.241436541429, 4173.624373806357, 4184.518780340254, 4185.183889141618, 4188.434561334211, 4193.853215137471, 4139.648129908946, 4149.585041495857, 4157.376393540962, 4159.9376009359885, 4159.980804702852, 4155.0, 4158.438610787535, 4161.084561396503, 4180.498340199165, 4181.937270940938, 3565.8038807865555, 3582.7133829293593, 3605.0, 3606.495090687306, 3617.963820361789, 5299.046171689094, 5317.229001794757, 5332.253484512172, 5336.119540275849, 5338.492843179931, 4604.815807367701, 4751.026039661861, 4802.735849528274, 4805.351277577517, 4811.0, 5775.27809023872, 5784.0, 5810.012297909366, 5813.418658134195, 5825.679587622679, 3894.941575876364, 3906.785126818024, 3911.5892831252595, 3912.726109172359, 3924.1759230561615, 6072.544559158081, 6149.831532008949, 6153.230846144232, 6153.815385538441, 6154.599951003215, 3997.540282867449, 4000.139969906484, 4004.1991601679197, 4006.579309172553, 4016.8393264269685, 4058.9188216236103, 4059.6143366380147, 4062.268791617478, 4066.898327541776, 4079.0, 4623.583877451046, 4757.119932812441, 4766.094442055998, 4772.403449568804, 4777.737224452619, 5833.300003999547, 5851.590388672752, 5854.0, 5865.472107510344, 5869.383714709979, 1436.490046033664, 1451.4629587052648, 1453.4331610671848, 1454.3019350711718, 1454.4981981216463, 934.1545900959643, 940.5297351324338, 940.5720397219249, 970.4177493503983, 975.9557273717055, 5032.421271553818, 5046.142155833517, 5055.140626093573, 5056.0, 5056.0, 6043.8791224175275, 6046.969765151146, 6063.090536419484, 6063.393660633901, 6064.090386442069, 4861.756912154378, 5000.199968005102, 5037.0, 5048.7728052237735, 5054.595632349403, 3219.500977348515, 3298.274379636476, 3315.8176300303717, 3318.070940136766, 3318.7179089777155, 5758.136279558016, 5761.971190144022, 5763.164341170507, 5766.769329226868, 5771.653700777967, 6316.05259211122, 6317.778877739257, 6320.988641817379, 6325.462335701517, 6331.05034244867, 5675.886482270332, 5703.74333155009, 5738.684372359477, 5752.568557358215, 5755.424457554211, 5899.292084949833, 5966.164736936746, 6081.817545473643, 6107.450329470369, 6109.358517355614, 5907.3501914790195, 5931.169636251015, 5945.524358051432, 5960.552958528041, 5961.880762384815, 5704.172894930295, 5712.6286791358425, 5730.312362516524, 5736.942630573641, 5747.712614369349, 4029.17401932609, 4068.6338229559483, 4072.490938632671, 4075.3886916962692, 4078.8368465261055, 5905.379935106752, 6040.275166979991, 6042.758289668364, 6058.787942421994, 6096.817095487142, 5692.601517893708, 5873.119032145212, 5873.442023007808, 5881.2942446904935, 5886.411358864079, 5854.912176317273, 5865.178874957594, 5870.002099643157, 5875.297363212799, 5884.0, 5691.8292451226525, 5718.8848174605555, 5738.0, 5739.139129130664, 5749.770009199752, 5866.090755932837, 5883.2057672213705, 5907.054871220584, 5916.526677865846, 5922.378150294329, 5549.1676248563035, 5725.112607545837, 5787.8553036174435, 5795.478406943395, 5799.536037116936], "unit": "score", "name": "prototype.html", "value": 4326.979330459939}, {"lowerIsBetter": false, "replicates": [698.3784431855648, 699.0562740300592, 705.9399951004165, 707.8619669164515, 709.7657772934932, 10247.180225581955, 11070.612528561502, 11202.607908723196, 11334.829977550344, 11338.829917551222, 10215.642452514163, 12076.396180190999, 12310.63068107956, 12337.50649974, 12343.074269429784, 424.27025516112235, 763.6525380951654, 775.8797386405116, 779.9821233290554, 781.4803155901319, 767.2557619109483, 774.2760518914832, 779.2441331908068, 783.8314762326099, 783.9686412543491, 811.2414892075899, 812.4231795425255, 818.2267756969666, 822.43663090783, 823.8805373220879, 807.2089352434617, 815.5881279953645, 818.6807145213371, 819.0253598218102, 820.6225136437216, 599.2180204832691, 599.3137857153534, 604.1572007050185, 605.5700452678603, 606.9908951365688, 11595.594154204562, 11749.118816088741, 11760.705982350424, 11831.526738930519, 11844.703882402922, 11136.888631113667, 11317.773644527064, 11439.485223164978, 11463.828042579285, 11718.179727419085, 8966.417182883091, 9045.457272563668, 9071.773205669844, 9107.453552786854, 9165.542340225327, 2969.732724054824, 2974.256435891027, 2979.7616190704694, 2997.2357048952595, 3051.0694238257324, 39117.804410978046, 39533.209335813124, 39940.0, 40179.0, 40649.39025914614, 8568.700095496752, 8574.185452382013, 8598.097199793932, 8636.524991125549, 8652.394332396672, 14784.852151478348, 14880.181590012653, 14914.030588011745, 14999.100053996795, 15187.0, 5960.791372301948, 5969.910451343233, 5988.221531200916, 6053.848653783691, 6104.11490333908, 3249.821259830732, 3315.966840331566, 3355.7818741781707, 3416.0, 3422.931541369159, 2418.600930846426, 2420.1408499982604, 2431.878406079689, 2436.2934748922967, 2445.743196964293, 454.0465023450727, 455.78805855277454, 469.2234352147202, 469.9506551812079, 470.6258524473052, 429.87103868839847, 452.4638303610232, 483.4971629505275, 554.6256277013, 562.3139769481227, 7481.289277518627, 7539.773806785805, 7573.810654733676, 7642.388608911274, 7646.694132234759, 403.9333509970822, 457.5150340638933, 515.31205840203, 530.6126527634771, 537.3846945247748, 3458.1008937676384, 3522.18989632386, 3586.1572530455323, 3599.8380072896784, 3634.3821550336506, 44595.55404445979, 44945.325820112725, 45560.77219613947, 45826.54173458223, 46057.0, 41250.79374603108, 41399.379009314885, 41900.790496047324, 42038.36942445866, 42040.579594204275, 38267.808660957075, 38856.61143388587, 38973.415398769044, 39221.2155756889, 39372.80313598413, 8143.348532117535, 8312.127226641358, 8406.831863362577, 8431.747047588582, 8445.817585537907, 29473.263168420963, 30177.09468715942, 31715.84142079275, 31835.36329273448, 31987.0, 36205.45691814572, 36560.63439365679, 37021.62978370182, 37387.504499819705, 37496.62503374931, 9518.095780900803, 9583.281253905845, 9692.127708506268, 9945.502724863583, 9952.0, 9938.0, 10326.328788628714, 10626.096781773636, 10961.945190274317, 10966.945165274123, 9350.76623084401, 9436.568448032487, 9535.761605959906, 9706.0, 9751.3661611995, 9785.951070244602, 9976.750581235527, 10275.434851083262, 10310.07209351162, 10343.120834729132, 9644.614215431304, 9847.212223021997, 9958.850617240601, 10202.948985255027, 10263.640772572924, 8881.555922203735, 9017.95491022567, 9024.954875225845, 9199.034101419255, 9231.307651925998, 8065.717699880711, 8637.740867773977, 8992.325575581726, 9132.178103970675, 9204.125608067223], "unit": "score", "name": "yui.html", "value": 5448.907279919757}], "name": "dromaeo_css", "value": 6030.191464243996}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [117.0, 113.0, 115.0, 114.0, 115.0, 128.0, 115.0, 115.0, 115.0, 114.0], "unit": "score", "name": "ai-astar", "value": 116.1}, {"lowerIsBetter": true, "replicates": [162.0, 134.0, 157.0, 174.0, 135.0, 159.0, 162.0, 145.0, 176.0, 136.0], "unit": "score", "name": "audio-beat-detection", "value": 154.0}, {"lowerIsBetter": true, "replicates": [164.0, 165.0, 165.0, 161.0, 165.0, 169.0, 167.0, 166.0, 168.0, 165.0], "unit": "score", "name": "audio-dft", "value": 165.5}, {"lowerIsBetter": true, "replicates": [74.0, 75.0, 74.0, 76.0, 73.0, 140.0, 75.0, 73.0, 73.0, 73.0], "unit": "score", "name": "audio-fft", "value": 80.6}, {"lowerIsBetter": true, "replicates": [99.0, 99.0, 138.0, 98.0, 98.0, 99.0, 143.0, 98.0, 98.0, 141.0], "unit": "score", "name": "audio-oscillator", "value": 111.1}, {"lowerIsBetter": true, "replicates": [120.0, 115.0, 115.0, 115.0, 116.0, 116.0, 116.0, 116.0, 115.0, 116.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.0}, {"lowerIsBetter": true, "replicates": [148.0, 149.0, 152.0, 148.0, 148.0, 148.0, 147.0, 148.0, 149.0, 149.0], "unit": "score", "name": "imaging-darkroom", "value": 148.6}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 97.0, 97.0, 96.0, 97.0, 97.0, 97.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.5}, {"lowerIsBetter": true, "replicates": [69.0, 68.0, 69.0, 68.0, 68.0, 68.0, 68.0, 75.0, 68.0, 67.0], "unit": "score", "name": "json-parse-financial", "value": 68.8}, {"lowerIsBetter": true, "replicates": [69.0, 73.0, 69.0, 71.0, 70.0, 71.0, 70.0, 71.0, 70.0, 71.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 70.5}, {"lowerIsBetter": true, "replicates": [84.0, 84.0, 92.0, 84.0, 86.0, 87.0, 85.0, 93.0, 86.0, 85.0], "unit": "score", "name": "stanford-crypto-aes", "value": 86.6}, {"lowerIsBetter": true, "replicates": [128.0, 137.0, 129.0, 128.0, 123.0, 121.0, 122.0, 133.0, 132.0, 134.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 128.7}, {"lowerIsBetter": true, "replicates": [140.0, 152.0, 155.0, 160.0, 152.0, 142.0, 151.0, 155.0, 153.0, 139.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 149.9}, {"lowerIsBetter": true, "replicates": [72.0, 75.0, 73.0, 71.0, 76.0, 71.0, 75.0, 74.0, 73.0, 71.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 73.1}], "name": "kraken", "value": 1566.0}]} 15:25:47 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,43]]", "result": "1566.00"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,43]]", "result": "6030.19"}}} 15:25:47 INFO - Return code: 0 15:25:47 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 15:25:47 ERROR - # TBPL SUCCESS # 15:25:47 INFO - Running post-action listener: _resource_record_post_action 15:25:47 INFO - Running post-run listener: _resource_record_post_run 15:25:48 INFO - Total resource usage - Wall time: 1194s; CPU: 13.0%; Read bytes: 8192; Write bytes: 529661952; Read time: 212; Write time: 408184 15:25:48 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 4096; Write bytes: 237535232; Read time: 64; Write time: 220704 15:25:48 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 4096; Write bytes: 291852288; Read time: 148; Write time: 187444 15:25:48 INFO - Running post-run listener: _upload_blobber_files 15:25:48 INFO - Blob upload gear active. 15:25:48 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 15:25:48 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 15:25:48 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-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 15:25:48 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-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 15:25:49 INFO - (blobuploader) - INFO - Open directory for files ... 15:25:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 15:25:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:25:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:25:49 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 15:25:49 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:25:49 INFO - (blobuploader) - INFO - Done attempting. 15:25:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 15:25:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:25:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:25:50 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 15:25:50 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:25:50 INFO - (blobuploader) - INFO - Done attempting. 15:25:50 INFO - (blobuploader) - INFO - Iteration through files over. 15:25:50 INFO - Return code: 0 15:25:50 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 15:25:50 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 15:25:50 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/e59f153d28a2b00d4a2db426b8ce410a38f3986d7b755ccd210031564ab15963df60e1d9ddd3abcbeebdf7cfc0cc7dae502b70364cda7a071b4ff83b77b74c61", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a6caa1c39af29e8167412e5b1247beb056c6bd8edb81cd032a71ab6e5ddeb8273ccc7b014f712459699033a2a228422a1d465d1759e8b432865ca6a5edd8a5aa"} 15:25:50 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 15:25:50 INFO - Writing to file /builds/slave/test/properties/blobber_files 15:25:50 INFO - Contents: 15:25:50 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/e59f153d28a2b00d4a2db426b8ce410a38f3986d7b755ccd210031564ab15963df60e1d9ddd3abcbeebdf7cfc0cc7dae502b70364cda7a071b4ff83b77b74c61", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a6caa1c39af29e8167412e5b1247beb056c6bd8edb81cd032a71ab6e5ddeb8273ccc7b014f712459699033a2a228422a1d465d1759e8b432865ca6a5edd8a5aa"} 15:25:50 INFO - Running post-run listener: copy_logs_to_upload_dir 15:25:50 INFO - Copying logs to upload dir... 15:25:50 INFO - mkdir: /builds/slave/test/build/upload/logs 15:25:50 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1230.884543 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2016-02-26 15:25:50.252734) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-26 15:25:50.256830) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411 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-Non-PGO/sha512/e59f153d28a2b00d4a2db426b8ce410a38f3986d7b755ccd210031564ab15963df60e1d9ddd3abcbeebdf7cfc0cc7dae502b70364cda7a071b4ff83b77b74c61", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a6caa1c39af29e8167412e5b1247beb056c6bd8edb81cd032a71ab6e5ddeb8273ccc7b014f712459699033a2a228422a1d465d1759e8b432865ca6a5edd8a5aa"} build_url:https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011415 build_url: 'https://queue.taskcluster.net/v1/task/FAjevRH9RoCapRkmxkuY3w/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/e59f153d28a2b00d4a2db426b8ce410a38f3986d7b755ccd210031564ab15963df60e1d9ddd3abcbeebdf7cfc0cc7dae502b70364cda7a071b4ff83b77b74c61", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a6caa1c39af29e8167412e5b1247beb056c6bd8edb81cd032a71ab6e5ddeb8273ccc7b014f712459699033a2a228422a1d465d1759e8b432865ca6a5edd8a5aa"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-26 15:25:50.282742) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 15:25:50.283073) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1456527771.837480-1887913411 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004611 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 15:25:50.367182) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-26 15:25:50.367500) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-26 15:25:50.367789) ========= ========= Total master_lag: 0.26 =========