builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-003 starttime: 1459779011.21 results: success (0) buildid: 20160404043017 builduid: 392c3061da544696af012023b83ed397 revision: 9bd90088875399347b05d87c67d3709e31539dcd ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.209227) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.210265) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.211671) ========= bash -c pwd in dir /builds/slave/test-pgo/. (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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=7de08804244eb36560b44971000001c3-1459778890.312023-1948284489 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006411 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.237598) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.237942) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.255513) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.255886) ========= rm -rf properties in dir /builds/slave/test-pgo/. (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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=7de08804244eb36560b44971000001c3-1459778890.312023-1948284489 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004576 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.308274) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.308596) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.309014) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.309330) ========= 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-pgo/. (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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=7de08804244eb36560b44971000001c3-1459778890.312023-1948284489 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-04 07:10:12-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 70.6M=0s 2016-04-04 07:10:12 (70.6 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.149952 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.472668) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.472995) ========= rm -rf scripts in dir /builds/slave/test-pgo/. (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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=7de08804244eb36560b44971000001c3-1459778890.312023-1948284489 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021163 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:11.522730) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-04 07:10:11.523141) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 9bd90088875399347b05d87c67d3709e31539dcd --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 9bd90088875399347b05d87c67d3709e31539dcd --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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=7de08804244eb36560b44971000001c3-1459778890.312023-1948284489 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-04 07:10:12,687 truncating revision to first 12 chars 2016-04-04 07:10:12,687 Setting DEBUG logging. 2016-04-04 07:10:12,687 attempt 1/10 2016-04-04 07:10:12,687 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/9bd900888753?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-04 07:10:13,992 unpacking tar archive at: mozilla-central-9bd900888753/testing/mozharness/ program finished with exit code 0 elapsedTime=1.606251 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-04 07:10:13.143524) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:13.143976) ========= echo 9bd90088875399347b05d87c67d3709e31539dcd in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'9bd90088875399347b05d87c67d3709e31539dcd'] 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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=7de08804244eb36560b44971000001c3-1459778890.312023-1948284489 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 9bd90088875399347b05d87c67d3709e31539dcd program finished with exit code 0 elapsedTime=0.004388 script_repo_revision: '9bd90088875399347b05d87c67d3709e31539dcd' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:13.193834) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:13.194198) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-04 07:10:13.207814) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 46 secs) (at 2016-04-04 07:10:13.208265) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test-pgo/. (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', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] 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-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=7de08804244eb36560b44971000001c3-1459778890.312023-1948284489 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:10:14 INFO - MultiFileLogger online at 20160404 07:10:14 in /builds/slave/test-pgo 07:10:14 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 07:10:14 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 07:10:14 INFO - {'append_to_log': False, 07:10:14 INFO - 'base_work_dir': '/builds/slave/test-pgo', 07:10:14 INFO - 'blob_upload_branch': 'Firefox', 07:10:14 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 07:10:14 INFO - 'branch': 'Firefox', 07:10:14 INFO - 'buildbot_json_path': 'buildprops.json', 07:10:14 INFO - 'config_files': ('talos/linux_config.py',), 07:10:14 INFO - 'default_actions': ('clobber', 07:10:14 INFO - 'read-buildbot-config', 07:10:14 INFO - 'download-and-extract', 07:10:14 INFO - 'populate-webroot', 07:10:14 INFO - 'create-virtualenv', 07:10:14 INFO - 'install', 07:10:14 INFO - 'run-tests'), 07:10:14 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:10:14 INFO - 'download_minidump_stackwalk': True, 07:10:14 INFO - 'download_symbols': 'ondemand', 07:10:14 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:10:14 INFO - 'tooltool.py': '/tools/tooltool.py', 07:10:14 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:10:14 INFO - '/tools/misc-python/virtualenv.py')}, 07:10:14 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:10:14 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:10:14 INFO - 'installer_path': 'installer.exe', 07:10:14 INFO - 'log_level': 'info', 07:10:14 INFO - 'log_name': 'talos', 07:10:14 INFO - 'log_to_console': True, 07:10:14 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:10:14 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:10:14 INFO - 'opt_config_files': (), 07:10:14 INFO - 'pip_index': False, 07:10:14 INFO - 'sps_profile': False, 07:10:14 INFO - 'sps_profile_interval': 0, 07:10:14 INFO - 'suite': 'dromaeojs-e10s', 07:10:14 INFO - 'system_bits': '32', 07:10:14 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:10:14 INFO - 'title': 'talos-linux64-ix-003', 07:10:14 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:10:14 INFO - 'use_talos_json': True, 07:10:14 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 07:10:14 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:10:14 INFO - 'work_dir': 'build'} 07:10:14 INFO - ##### 07:10:14 INFO - ##### Running clobber step. 07:10:14 INFO - ##### 07:10:14 INFO - Running pre-action listener: _resource_record_pre_action 07:10:14 INFO - Running main action method: clobber 07:10:14 INFO - rmtree: /builds/slave/test-pgo/build 07:10:14 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 07:10:14 INFO - Running post-action listener: _resource_record_post_action 07:10:14 INFO - ##### 07:10:14 INFO - ##### Running read-buildbot-config step. 07:10:14 INFO - ##### 07:10:14 INFO - Running pre-action listener: _resource_record_pre_action 07:10:14 INFO - Running main action method: read_buildbot_config 07:10:14 INFO - Using buildbot properties: 07:10:14 INFO - { 07:10:14 INFO - "project": "", 07:10:14 INFO - "product": "firefox", 07:10:14 INFO - "script_repo_revision": "production", 07:10:14 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 07:10:14 INFO - "repository": "", 07:10:14 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs-e10s", 07:10:14 INFO - "buildid": "20160404043017", 07:10:14 INFO - "pgo_build": "True", 07:10:14 INFO - "basedir": "/builds/slave/test-pgo", 07:10:14 INFO - "buildnumber": 685, 07:10:14 INFO - "slavename": "talos-linux64-ix-003", 07:10:14 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 07:10:14 INFO - "platform": "ubuntu64_hw", 07:10:14 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 07:10:14 INFO - "branch": "mozilla-central", 07:10:14 INFO - "repo_path": "mozilla-central", 07:10:14 INFO - "revision": "9bd90088875399347b05d87c67d3709e31539dcd", 07:10:14 INFO - "stage_platform": "linux64-pgo", 07:10:14 INFO - "builduid": "392c3061da544696af012023b83ed397", 07:10:14 INFO - "slavebuilddir": "test" 07:10:14 INFO - } 07:10:14 INFO - Found installer url https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 07:10:14 INFO - Running post-action listener: _resource_record_post_action 07:10:14 INFO - ##### 07:10:14 INFO - ##### Running download-and-extract step. 07:10:14 INFO - ##### 07:10:14 INFO - Running pre-action listener: _resource_record_pre_action 07:10:14 INFO - Running main action method: download_and_extract 07:10:14 INFO - mkdir: /builds/slave/test-pgo/build/tests 07:10:14 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')]} 07:10:14 INFO - https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 07:10:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:10:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:10:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:10:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 07:10:23 INFO - Downloaded 1361 bytes. 07:10:23 INFO - Reading from file /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 07:10:23 INFO - Using the following test package requirements: 07:10:23 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 07:10:23 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:10:23 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 07:10:23 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:10:23 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 07:10:23 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:10:23 INFO - u'jsshell-linux-x86_64.zip'], 07:10:23 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:10:23 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 07:10:23 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 07:10:23 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:10:23 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 07:10:23 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:10:23 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 07:10:23 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:10:23 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 07:10:23 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 07:10:23 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 07:10:23 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 07:10: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')]} 07:10:23 INFO - https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:10:23 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:10:23 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:10:23 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:10:23 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:10:36 INFO - Downloaded 23696556 bytes. 07:10:36 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 07:10:36 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 07:10:37 INFO - Return code: 0 07:10:37 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 07:10:37 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')]} 07:10:37 INFO - https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:10:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:10:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:10:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 07:10:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:10:38 INFO - Downloaded 23696556 bytes. 07:10:38 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 07:10:38 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 07:10:40 INFO - Return code: 0 07:10: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')]} 07:10:40 INFO - https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 07:10:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 07:10:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 07:10:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 07:10:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 07:10:41 INFO - Downloaded 10847584 bytes. 07:10:41 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 07:10:41 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 07:10:41 INFO - Return code: 0 07:10:41 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')]} 07:10:41 INFO - https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 07:10:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:10:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:10:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:10:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 07:10:43 INFO - Downloaded 57682760 bytes. 07:10:43 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:10:43 INFO - mkdir: /builds/slave/test-pgo/properties 07:10:43 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 07:10:43 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 07:10:43 INFO - Contents: 07:10:43 INFO - build_url:https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 07:10:44 INFO - Running post-action listener: _resource_record_post_action 07:10:44 INFO - Running post-action listener: set_extra_try_arguments 07:10:44 INFO - ##### 07:10:44 INFO - ##### Running populate-webroot step. 07:10:44 INFO - ##### 07:10:44 INFO - Running pre-action listener: _resource_record_pre_action 07:10:44 INFO - Running main action method: populate_webroot 07:10:44 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:10:44 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:10:44 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:10:44 INFO - '--tppagecycles', 07:10:44 INFO - '7'], 07:10:44 INFO - 'tests': ['tsvgm']}}, 07:10:44 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 07:10:44 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 07:10:44 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:10:44 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 07:10:44 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 07:10:44 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:10:44 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:10:44 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:10:44 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:10:44 INFO - 'talos_options': ['--e10s'], 07:10:44 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:10:44 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:10:44 INFO - 'tests': ['damp', 'tps']}, 07:10:44 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:10:44 INFO - 'talos_options': ['--e10s'], 07:10:44 INFO - 'tests': ['damp', 'tps']}, 07:10:44 INFO - 'g3': {'tests': ['dromaeo_dom']}, 07:10:44 INFO - 'g3-e10s': {'talos_options': ['--e10s'], 07:10:44 INFO - 'tests': ['dromaeo_dom']}, 07:10:44 INFO - 'other': {'tests': ['a11yr', 07:10:44 INFO - 'ts_paint', 07:10:44 INFO - 'tpaint', 07:10:44 INFO - 'sessionrestore', 07:10:44 INFO - 'sessionrestore_no_auto_restore', 07:10:44 INFO - 'tabpaint']}, 07:10:44 INFO - 'other-e10s': {'talos_options': ['--e10s'], 07:10:44 INFO - 'tests': ['a11yr', 07:10:44 INFO - 'ts_paint', 07:10:44 INFO - 'tpaint', 07:10:44 INFO - 'sessionrestore', 07:10:44 INFO - 'sessionrestore_no_auto_restore', 07:10:44 INFO - 'tabpaint']}, 07:10:44 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 07:10:44 INFO - 'tests': ['a11yr', 07:10:44 INFO - 'ts_paint', 07:10:44 INFO - 'tpaint', 07:10:44 INFO - 'sessionrestore', 07:10:44 INFO - 'sessionrestore_no_auto_restore', 07:10:44 INFO - 'tabpaint']}, 07:10:44 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 07:10:44 INFO - 'tests': ['a11yr', 07:10:44 INFO - 'ts_paint', 07:10:44 INFO - 'tpaint', 07:10:44 INFO - 'sessionrestore', 07:10:44 INFO - 'sessionrestore_no_auto_restore', 07:10:44 INFO - 'tabpaint']}, 07:10:44 INFO - 'other_l64': {'tests': ['a11yr', 07:10:44 INFO - 'ts_paint', 07:10:44 INFO - 'tpaint', 07:10:44 INFO - 'sessionrestore', 07:10:44 INFO - 'sessionrestore_no_auto_restore', 07:10:44 INFO - 'tabpaint']}, 07:10:44 INFO - 'other_nol64': {'tests': ['a11yr', 07:10:44 INFO - 'ts_paint', 07:10:44 INFO - 'tpaint', 07:10:44 INFO - 'sessionrestore', 07:10:44 INFO - 'sessionrestore_no_auto_restore', 07:10:44 INFO - 'tabpaint']}, 07:10:44 INFO - 'svgr': {'tests': ['tsvgx', 07:10:44 INFO - 'tsvgr_opacity', 07:10:44 INFO - 'tart', 07:10:44 INFO - 'tscrollx', 07:10:44 INFO - 'cart']}, 07:10:44 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 07:10:44 INFO - 'tests': ['tsvgx', 07:10:44 INFO - 'tsvgr_opacity', 07:10:44 INFO - 'tart', 07:10:44 INFO - 'tscrollx', 07:10:44 INFO - 'cart']}, 07:10:44 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:10:44 INFO - 'tests': ['tp5o']}, 07:10:44 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:10:44 INFO - 'talos_options': ['--e10s'], 07:10:44 INFO - 'tests': ['tp5o']}, 07:10:44 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:10:44 INFO - 'talos_options': ['--xperf_path', 07:10:44 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:10:44 INFO - 'tests': ['tp5n']}, 07:10:44 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:10:44 INFO - 'talos_options': ['--e10s', 07:10:44 INFO - '--xperf_path', 07:10:44 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:10:44 INFO - 'tests': ['tp5n']}}, 07:10:44 INFO - 'talos.zip': {'path': '', 07:10:44 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:10:44 INFO - Running post-action listener: _resource_record_post_action 07:10:44 INFO - ##### 07:10:44 INFO - ##### Running create-virtualenv step. 07:10:44 INFO - ##### 07:10:44 INFO - Running pre-action listener: _resource_record_pre_action 07:10:44 INFO - Running main action method: create_virtualenv 07:10:44 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 07:10:44 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 07:10:44 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 07:10:44 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:10:44 INFO - Using real prefix '/usr' 07:10:44 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 07:10:45 INFO - Installing distribute.............................................................................................................................................................................................done. 07:10:47 INFO - Installing pip.................done. 07:10:47 INFO - Return code: 0 07:10:47 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 07:10: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')]} 07:10:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:10:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:10: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')]} 07:10:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:10:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:10:47 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/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 0x7f649d5f1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23a18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x246d8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24fc8b0>, '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 0x24fd7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24fdc60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 07:10:47 INFO - Running command: ['/builds/slave/test-pgo/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-pgo/build 07:10:47 INFO - Copy/paste: /builds/slave/test-pgo/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 07:10:47 INFO - Using env: {'DISPLAY': ':0', 07:10:47 INFO - 'HOME': '/home/cltbld', 07:10:47 INFO - 'LANG': 'en_US.UTF-8', 07:10:47 INFO - 'LANGUAGE': 'en_US:en', 07:10:47 INFO - 'LOGNAME': 'cltbld', 07:10:47 INFO - 'MAIL': '/var/mail/cltbld', 07:10:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:10:47 INFO - 'MOZ_NO_REMOTE': '1', 07:10:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:10:47 INFO - 'NO_EM_RESTART': '1', 07:10:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:10:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:10:47 INFO - 'PWD': '/builds/slave/test-pgo', 07:10:47 INFO - 'SHELL': '/bin/bash', 07:10:47 INFO - 'SHLVL': '1', 07:10:47 INFO - 'TERM': 'linux', 07:10:47 INFO - 'TMOUT': '86400', 07:10:47 INFO - 'USER': 'cltbld', 07:10:47 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', 07:10:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:10:47 INFO - '_': '/tools/buildbot/bin/python'} 07:10:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:10:47 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 07:10:47 INFO - Cleaning up... 07:10:47 INFO - Return code: 0 07:10:47 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 07:10: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')]} 07:10:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:10:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:10: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')]} 07:10:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:10:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:10:47 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/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 0x7f649d5f1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23a18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x246d8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24fc8b0>, '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 0x24fd7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24fdc60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 07:10:47 INFO - Running command: ['/builds/slave/test-pgo/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-pgo/build 07:10:47 INFO - Copy/paste: /builds/slave/test-pgo/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 07:10:47 INFO - Using env: {'DISPLAY': ':0', 07:10:47 INFO - 'HOME': '/home/cltbld', 07:10:47 INFO - 'LANG': 'en_US.UTF-8', 07:10:47 INFO - 'LANGUAGE': 'en_US:en', 07:10:47 INFO - 'LOGNAME': 'cltbld', 07:10:47 INFO - 'MAIL': '/var/mail/cltbld', 07:10:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:10:47 INFO - 'MOZ_NO_REMOTE': '1', 07:10:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:10:47 INFO - 'NO_EM_RESTART': '1', 07:10:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:10:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:10:47 INFO - 'PWD': '/builds/slave/test-pgo', 07:10:47 INFO - 'SHELL': '/bin/bash', 07:10:47 INFO - 'SHLVL': '1', 07:10:47 INFO - 'TERM': 'linux', 07:10:47 INFO - 'TMOUT': '86400', 07:10:47 INFO - 'USER': 'cltbld', 07:10:47 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', 07:10:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:10:47 INFO - '_': '/tools/buildbot/bin/python'} 07:10:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:10:47 INFO - Downloading/unpacking psutil>=0.7.1 07:10: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 07:10: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 07:10: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 07:10: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 07:10: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 07:10: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 07:10:49 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 07:10:49 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:10:49 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:10:49 INFO - Installing collected packages: psutil 07:10:49 INFO - Running setup.py install for psutil 07:10:49 INFO - building 'psutil._psutil_linux' extension 07:10:49 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 07:10:49 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 07:10:50 INFO - building 'psutil._psutil_posix' extension 07:10:50 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 07:10:50 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 07:10:50 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:10:50 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:10:50 INFO - Successfully installed psutil 07:10:50 INFO - Cleaning up... 07:10:50 INFO - Return code: 0 07:10:50 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 07:10:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:10:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:10:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:10:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:10:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:10:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:10:50 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/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 0x7f649d5f1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23a18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x246d8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24fc8b0>, '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 0x24fd7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24fdc60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 07:10:50 INFO - Running command: ['/builds/slave/test-pgo/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-pgo/build 07:10:50 INFO - Copy/paste: /builds/slave/test-pgo/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 07:10:50 INFO - Using env: {'DISPLAY': ':0', 07:10:50 INFO - 'HOME': '/home/cltbld', 07:10:50 INFO - 'LANG': 'en_US.UTF-8', 07:10:50 INFO - 'LANGUAGE': 'en_US:en', 07:10:50 INFO - 'LOGNAME': 'cltbld', 07:10:50 INFO - 'MAIL': '/var/mail/cltbld', 07:10:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:10:50 INFO - 'MOZ_NO_REMOTE': '1', 07:10:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:10:50 INFO - 'NO_EM_RESTART': '1', 07:10:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:10:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:10:50 INFO - 'PWD': '/builds/slave/test-pgo', 07:10:50 INFO - 'SHELL': '/bin/bash', 07:10:50 INFO - 'SHLVL': '1', 07:10:50 INFO - 'TERM': 'linux', 07:10:50 INFO - 'TMOUT': '86400', 07:10:50 INFO - 'USER': 'cltbld', 07:10:50 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', 07:10:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:10:50 INFO - '_': '/tools/buildbot/bin/python'} 07:10:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:10:50 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 07:10: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 07:10: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 07:10: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 07:10: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 07:10: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 07:10: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 07:10:52 INFO - Downloading mozsystemmonitor-0.0.tar.gz 07:10:52 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:10:52 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 07:10:52 INFO - Installing collected packages: mozsystemmonitor 07:10:52 INFO - Running setup.py install for mozsystemmonitor 07:10:52 INFO - Successfully installed mozsystemmonitor 07:10:52 INFO - Cleaning up... 07:10:52 INFO - Return code: 0 07:10:52 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 07:10:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:10:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:10:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:10:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:10:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:10:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:10:52 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/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 0x7f649d5f1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23a18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x246d8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24fc8b0>, '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 0x24fd7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24fdc60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 07:10:52 INFO - Running command: ['/builds/slave/test-pgo/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-pgo/build 07:10:52 INFO - Copy/paste: /builds/slave/test-pgo/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 07:10:52 INFO - Using env: {'DISPLAY': ':0', 07:10:52 INFO - 'HOME': '/home/cltbld', 07:10:52 INFO - 'LANG': 'en_US.UTF-8', 07:10:52 INFO - 'LANGUAGE': 'en_US:en', 07:10:52 INFO - 'LOGNAME': 'cltbld', 07:10:52 INFO - 'MAIL': '/var/mail/cltbld', 07:10:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:10:52 INFO - 'MOZ_NO_REMOTE': '1', 07:10:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:10:52 INFO - 'NO_EM_RESTART': '1', 07:10:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:10:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:10:52 INFO - 'PWD': '/builds/slave/test-pgo', 07:10:52 INFO - 'SHELL': '/bin/bash', 07:10:52 INFO - 'SHLVL': '1', 07:10:52 INFO - 'TERM': 'linux', 07:10:52 INFO - 'TMOUT': '86400', 07:10:52 INFO - 'USER': 'cltbld', 07:10:52 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', 07:10:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:10:52 INFO - '_': '/tools/buildbot/bin/python'} 07:10:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:10:52 INFO - Downloading/unpacking blobuploader==1.2.4 07:10: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 07:10: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 07:10: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 07:10: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 07:10: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 07:10: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 07:10:54 INFO - Downloading blobuploader-1.2.4.tar.gz 07:10:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:10:54 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:10:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:10:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:10:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:10:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:10:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:10:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:10:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 07:10:55 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:10:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:10:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:10:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:10:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:10:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:10:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:10:55 INFO - Downloading docopt-0.6.1.tar.gz 07:10:55 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 07:10:55 INFO - Installing collected packages: blobuploader, requests, docopt 07:10:55 INFO - Running setup.py install for blobuploader 07:10:55 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:10:55 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 07:10:55 INFO - Running setup.py install for requests 07:10:55 INFO - Running setup.py install for docopt 07:10:55 INFO - Successfully installed blobuploader requests docopt 07:10:55 INFO - Cleaning up... 07:10:56 INFO - Return code: 0 07:10:56 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:10:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:10:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:10:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:10:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:10:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:10:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:10:56 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/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 0x7f649d5f1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23a18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x246d8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24fc8b0>, '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 0x24fd7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24fdc60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 07:10:56 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/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-pgo/build/tests/config 07:10:56 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test-pgo/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 07:10:56 INFO - Using env: {'DISPLAY': ':0', 07:10:56 INFO - 'HOME': '/home/cltbld', 07:10:56 INFO - 'LANG': 'en_US.UTF-8', 07:10:56 INFO - 'LANGUAGE': 'en_US:en', 07:10:56 INFO - 'LOGNAME': 'cltbld', 07:10:56 INFO - 'MAIL': '/var/mail/cltbld', 07:10:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:10:56 INFO - 'MOZ_NO_REMOTE': '1', 07:10:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:10:56 INFO - 'NO_EM_RESTART': '1', 07:10:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:10:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:10:56 INFO - 'PWD': '/builds/slave/test-pgo', 07:10:56 INFO - 'SHELL': '/bin/bash', 07:10:56 INFO - 'SHLVL': '1', 07:10:56 INFO - 'TERM': 'linux', 07:10:56 INFO - 'TMOUT': '86400', 07:10:56 INFO - 'USER': 'cltbld', 07:10:56 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', 07:10:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:10:56 INFO - '_': '/tools/buildbot/bin/python'} 07:10:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:10:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:10:56 INFO - Running setup.py (path:/tmp/pip-aQm8qJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:10:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:10:56 INFO - Running setup.py (path:/tmp/pip-zgOmgI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:10:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:10:56 INFO - Running setup.py (path:/tmp/pip-ddqVdY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:10:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:10:56 INFO - Running setup.py (path:/tmp/pip-0uzdLx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:10:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 07:10:56 INFO - Running setup.py (path:/tmp/pip-GFYoEK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 07:10:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:10:56 INFO - Running setup.py (path:/tmp/pip-RKwlUP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:10:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:10:56 INFO - Running setup.py (path:/tmp/pip-GsVaI4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:10:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:10:56 INFO - Running setup.py (path:/tmp/pip-y9uhzf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:10:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 07:10:56 INFO - Running setup.py (path:/tmp/pip-gBEMKz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 07:10:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 07:10:56 INFO - Running setup.py (path:/tmp/pip-MiJw2u-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 07:10:56 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:10:56 INFO - Running setup.py (path:/tmp/pip-75d182-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:10:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:10:57 INFO - Running setup.py (path:/tmp/pip-8PJPAF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:10:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:10:57 INFO - Running setup.py (path:/tmp/pip-jToJv_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:10:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:10:57 INFO - Running setup.py (path:/tmp/pip-bRIJHH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:10:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:10:57 INFO - Running setup.py (path:/tmp/pip-GcSTIX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:10:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 07:10:57 INFO - Running setup.py (path:/tmp/pip-70_mPh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 07:10:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 07:10:57 INFO - Running setup.py (path:/tmp/pip-0vK4bH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 07:10:57 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:10:57 INFO - Running setup.py install for manifestparser 07:10:57 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 07:10:57 INFO - Running setup.py install for mozcrash 07:10:57 INFO - Running setup.py install for mozdebug 07:10:57 INFO - Running setup.py install for mozdevice 07:10:57 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 07:10:57 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 07:10:57 INFO - Running setup.py install for mozfile 07:10:57 INFO - Running setup.py install for mozhttpd 07:10:58 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 07:10:58 INFO - Running setup.py install for mozinfo 07:10:58 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 07:10:58 INFO - Running setup.py install for mozInstall 07:10:58 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 07:10:58 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 07:10:58 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 07:10:58 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 07:10:58 INFO - Running setup.py install for mozleak 07:10:58 INFO - Running setup.py install for mozlog 07:10:58 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 07:10:58 INFO - Running setup.py install for moznetwork 07:10:58 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 07:10:58 INFO - Running setup.py install for mozprocess 07:10:58 INFO - Running setup.py install for mozprofile 07:10:58 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 07:10:58 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 07:10:58 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 07:10:58 INFO - Running setup.py install for mozrunner 07:10:58 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 07:10:58 INFO - Running setup.py install for mozscreenshot 07:10:59 INFO - Running setup.py install for moztest 07:10:59 INFO - Running setup.py install for mozversion 07:10:59 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 07:10:59 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:10:59 INFO - Cleaning up... 07:10:59 INFO - Return code: 0 07:10:59 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:10:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:10:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:10:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:10:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:10:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:10:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:10:59 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/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 0x7f649d5f1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23a18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x246d8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24fc8b0>, '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 0x24fd7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24fdc60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 07:10:59 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/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-pgo/build/tests/config 07:10:59 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/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 07:10:59 INFO - Using env: {'DISPLAY': ':0', 07:10:59 INFO - 'HOME': '/home/cltbld', 07:10:59 INFO - 'LANG': 'en_US.UTF-8', 07:10:59 INFO - 'LANGUAGE': 'en_US:en', 07:10:59 INFO - 'LOGNAME': 'cltbld', 07:10:59 INFO - 'MAIL': '/var/mail/cltbld', 07:10:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:10:59 INFO - 'MOZ_NO_REMOTE': '1', 07:10:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:10:59 INFO - 'NO_EM_RESTART': '1', 07:10:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:10:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:10:59 INFO - 'PWD': '/builds/slave/test-pgo', 07:10:59 INFO - 'SHELL': '/bin/bash', 07:10:59 INFO - 'SHLVL': '1', 07:10:59 INFO - 'TERM': 'linux', 07:10:59 INFO - 'TMOUT': '86400', 07:10:59 INFO - 'USER': 'cltbld', 07:10:59 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', 07:10:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:10:59 INFO - '_': '/tools/buildbot/bin/python'} 07:10:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:10:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:10:59 INFO - Running setup.py (path:/tmp/pip-f6vK9a-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:10:59 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 07:10:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:10:59 INFO - Running setup.py (path:/tmp/pip-mVzhUL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:10:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 07:10:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:10:59 INFO - Running setup.py (path:/tmp/pip-1t4A4X-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:10:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 07:10:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:10:59 INFO - Running setup.py (path:/tmp/pip-DFYMz8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:10:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 07:10:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 07:10:59 INFO - Running setup.py (path:/tmp/pip-wRmZaZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 07:10:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5)) 07:10:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:10:59 INFO - Running setup.py (path:/tmp/pip-u1U2um-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:10:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6)) 07:10:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:10:59 INFO - Running setup.py (path:/tmp/pip-kiW487-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:10:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7)) 07:10:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:10:59 INFO - Running setup.py (path:/tmp/pip-pIfjTf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8)) 07:11:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 07:11:00 INFO - Running setup.py (path:/tmp/pip-sD0qLY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 07:11:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 07:11:00 INFO - Running setup.py (path:/tmp/pip-TqtO4Y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 07:11:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:11:00 INFO - Running setup.py (path:/tmp/pip-exzJYV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 07:11:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:11:00 INFO - Running setup.py (path:/tmp/pip-rLXvnc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 07:11:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:11:00 INFO - Running setup.py (path:/tmp/pip-95EUB8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13)) 07:11:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:11:00 INFO - Running setup.py (path:/tmp/pip-hBhtL8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 07:11:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:11:00 INFO - Running setup.py (path:/tmp/pip-KZTKvA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 07:11:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 07:11:00 INFO - Running setup.py (path:/tmp/pip-Yiuhm7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16)) 07:11:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 07:11:00 INFO - Running setup.py (path:/tmp/pip-vmbmwJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 07:11:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 07:11:00 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 07:11:00 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 07:11:00 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 07:11:00 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 07:11:00 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 07:11:00 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 07:11:00 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 07:11:02 INFO - Downloading blessings-1.6.tar.gz 07:11:02 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 07:11:02 INFO - Installing collected packages: blessings 07:11:02 INFO - Running setup.py install for blessings 07:11:02 INFO - Successfully installed blessings 07:11:02 INFO - Cleaning up... 07:11:02 INFO - Return code: 0 07:11:02 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 07:11:02 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 07:11:02 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 07:11:03 INFO - Reading from file tmpfile_stdout 07:11:03 INFO - Current package versions: 07:11:03 INFO - argparse == 1.2.1 07:11:03 INFO - blessings == 1.6 07:11:03 INFO - blobuploader == 1.2.4 07:11:03 INFO - docopt == 0.6.1 07:11:03 INFO - manifestparser == 1.1 07:11:03 INFO - mozInstall == 1.12 07:11:03 INFO - mozcrash == 0.17 07:11:03 INFO - mozdebug == 0.1 07:11:03 INFO - mozdevice == 0.48 07:11:03 INFO - mozfile == 1.2 07:11:03 INFO - mozhttpd == 0.7 07:11:03 INFO - mozinfo == 0.9 07:11:03 INFO - mozleak == 0.1 07:11:03 INFO - mozlog == 3.1 07:11:03 INFO - moznetwork == 0.27 07:11:03 INFO - mozprocess == 0.22 07:11:03 INFO - mozprofile == 0.28 07:11:03 INFO - mozrunner == 6.11 07:11:03 INFO - mozscreenshot == 0.1 07:11:03 INFO - mozsystemmonitor == 0.0 07:11:03 INFO - moztest == 0.7 07:11:03 INFO - mozversion == 1.4 07:11:03 INFO - psutil == 3.1.1 07:11:03 INFO - requests == 1.2.3 07:11:03 INFO - wsgiref == 0.1.2 07:11:03 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:11:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:11:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:11:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:03 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/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 0x7f649d5f1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23a18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x246d8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24fc8b0>, '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 0x24fd7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24fdc60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 07:11:03 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/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-pgo/build/tests/talos 07:11:03 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/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 07:11:03 INFO - Using env: {'DISPLAY': ':0', 07:11:03 INFO - 'HOME': '/home/cltbld', 07:11:03 INFO - 'LANG': 'en_US.UTF-8', 07:11:03 INFO - 'LANGUAGE': 'en_US:en', 07:11:03 INFO - 'LOGNAME': 'cltbld', 07:11:03 INFO - 'MAIL': '/var/mail/cltbld', 07:11:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:11:03 INFO - 'MOZ_NO_REMOTE': '1', 07:11:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:11:03 INFO - 'NO_EM_RESTART': '1', 07:11:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:11:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:11:03 INFO - 'PWD': '/builds/slave/test-pgo', 07:11:03 INFO - 'SHELL': '/bin/bash', 07:11:03 INFO - 'SHLVL': '1', 07:11:03 INFO - 'TERM': 'linux', 07:11:03 INFO - 'TMOUT': '86400', 07:11:03 INFO - 'USER': 'cltbld', 07:11:03 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', 07:11:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:11:03 INFO - '_': '/tools/buildbot/bin/python'} 07:11:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:11:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 07:11:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2)) 07:11:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 07:11:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 07:11:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5)) 07:11:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6)) 07:11:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7)) 07:11:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8)) 07:11:03 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 9)) 07:11:03 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 07:11:03 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 07:11:03 INFO - Cleaning up... 07:11:03 INFO - Return code: 0 07:11:03 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 07:11:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:11:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:11:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:03 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/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 0x7f649d5f1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23a18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x246d8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24fc8b0>, '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 0x24fd7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24fdc60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 07:11:03 INFO - Running command: ['/builds/slave/test-pgo/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-pgo/build 07:11:03 INFO - Copy/paste: /builds/slave/test-pgo/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 07:11:03 INFO - Using env: {'DISPLAY': ':0', 07:11:03 INFO - 'HOME': '/home/cltbld', 07:11:03 INFO - 'LANG': 'en_US.UTF-8', 07:11:03 INFO - 'LANGUAGE': 'en_US:en', 07:11:03 INFO - 'LOGNAME': 'cltbld', 07:11:03 INFO - 'MAIL': '/var/mail/cltbld', 07:11:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:11:03 INFO - 'MOZ_NO_REMOTE': '1', 07:11:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:11:03 INFO - 'NO_EM_RESTART': '1', 07:11:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:11:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:11:03 INFO - 'PWD': '/builds/slave/test-pgo', 07:11:03 INFO - 'SHELL': '/bin/bash', 07:11:03 INFO - 'SHLVL': '1', 07:11:03 INFO - 'TERM': 'linux', 07:11:03 INFO - 'TMOUT': '86400', 07:11:03 INFO - 'USER': 'cltbld', 07:11:03 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', 07:11:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:11:03 INFO - '_': '/tools/buildbot/bin/python'} 07:11:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:11:03 INFO - Downloading/unpacking jsonschema 07:11:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:05 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:11:05 INFO - Downloading/unpacking functools32 (from jsonschema) 07:11:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:05 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:05 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:05 INFO - Downloading functools32-3.2.3-2.tar.gz 07:11:05 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 07:11:05 INFO - warning: no files found matching '*.txt' 07:11:05 INFO - no previously-included directories found matching 'build' 07:11:05 INFO - no previously-included directories found matching 'dist' 07:11:05 INFO - no previously-included directories found matching '.git*' 07:11:05 INFO - Installing collected packages: jsonschema, functools32 07:11:05 INFO - Running setup.py install for functools32 07:11:05 INFO - warning: no files found matching '*.txt' 07:11:05 INFO - no previously-included directories found matching 'build' 07:11:05 INFO - no previously-included directories found matching 'dist' 07:11:05 INFO - no previously-included directories found matching '.git*' 07:11:05 INFO - Successfully installed jsonschema functools32 07:11:05 INFO - Cleaning up... 07:11:05 INFO - Return code: 0 07:11:05 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 07:11:05 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')]} 07:11:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:11:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:05 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')]} 07:11:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:11:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:05 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/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 0x7f649d5f1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23a18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x246d8d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24fc8b0>, '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 0x24fd7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24fdc60>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 07:11:05 INFO - Running command: ['/builds/slave/test-pgo/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-pgo/build 07:11:05 INFO - Copy/paste: /builds/slave/test-pgo/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 07:11:05 INFO - Using env: {'DISPLAY': ':0', 07:11:05 INFO - 'HOME': '/home/cltbld', 07:11:05 INFO - 'LANG': 'en_US.UTF-8', 07:11:05 INFO - 'LANGUAGE': 'en_US:en', 07:11:05 INFO - 'LOGNAME': 'cltbld', 07:11:05 INFO - 'MAIL': '/var/mail/cltbld', 07:11:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:11:05 INFO - 'MOZ_NO_REMOTE': '1', 07:11:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:11:05 INFO - 'NO_EM_RESTART': '1', 07:11:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:11:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:11:05 INFO - 'PWD': '/builds/slave/test-pgo', 07:11:05 INFO - 'SHELL': '/bin/bash', 07:11:05 INFO - 'SHLVL': '1', 07:11:05 INFO - 'TERM': 'linux', 07:11:05 INFO - 'TMOUT': '86400', 07:11:05 INFO - 'USER': 'cltbld', 07:11:05 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', 07:11:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:11:05 INFO - '_': '/tools/buildbot/bin/python'} 07:11:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:11:06 INFO - Downloading/unpacking flake8 07:11:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:07 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 07:11:07 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 07:11:07 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 07:11:07 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 07:11:07 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 07:11:07 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 07:11:07 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 07:11:07 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 07:11:08 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 07:11:08 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 07:11:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:08 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 07:11:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:08 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 07:11:08 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:11:08 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:11:08 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:11:08 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:11:08 INFO - no previously-included directories found matching 'docs/_build' 07:11:08 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 07:11:08 INFO - Running setup.py install for pep8 07:11:08 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:11:08 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:11:08 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:11:08 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:11:08 INFO - no previously-included directories found matching 'docs/_build' 07:11:08 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 07:11:08 INFO - Successfully installed flake8 mccabe pyflakes pep8 07:11:08 INFO - Cleaning up... 07:11:08 INFO - Return code: 0 07:11:08 INFO - Running post-action listener: _resource_record_post_action 07:11:08 INFO - Running post-action listener: _start_resource_monitoring 07:11:08 INFO - Starting resource monitoring. 07:11:08 INFO - ##### 07:11:08 INFO - ##### Running install step. 07:11:08 INFO - ##### 07:11:08 INFO - Running pre-action listener: _resource_record_pre_action 07:11:08 INFO - Running main action method: install 07:11:08 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 07:11:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 07:11:09 INFO - Reading from file tmpfile_stdout 07:11:09 INFO - Detecting whether we're running mozinstall >=1.0... 07:11:09 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 07:11:09 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 07:11:09 INFO - Reading from file tmpfile_stdout 07:11:09 INFO - Output received: 07:11:09 INFO - Usage: mozinstall [options] installer 07:11:09 INFO - Options: 07:11:09 INFO - -h, --help show this help message and exit 07:11:09 INFO - -d DEST, --destination=DEST 07:11:09 INFO - Directory to install application into. [default: 07:11:09 INFO - "/builds/slave/test-pgo"] 07:11:09 INFO - --app=APP Application being installed. [default: firefox] 07:11:09 INFO - mkdir: /builds/slave/test-pgo/build/application 07:11:09 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 07:11:09 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 07:11:25 INFO - Reading from file tmpfile_stdout 07:11:25 INFO - Output received: 07:11:25 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 07:11:25 INFO - Running post-action listener: _resource_record_post_action 07:11:25 INFO - ##### 07:11:25 INFO - ##### Running run-tests step. 07:11:25 INFO - ##### 07:11:25 INFO - Running pre-action listener: _resource_record_pre_action 07:11:25 INFO - Running main action method: run_tests 07:11:25 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 07:11:25 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 07:11:25 INFO - Python 2.7.3 07:11:25 INFO - Return code: 0 07:11:25 INFO - grabbing minidump binary from tooltool 07:11: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')]} 07:11:25 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-pgo/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 0x24fc8b0>, '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 0x24fd7b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24fdc60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 07:11:25 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 07:11:25 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 07:11:25 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:11:25 INFO - Return code: 0 07:11:25 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 07:11:25 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 07:11:25 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 07:11:25 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 07:11:25 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 07:11:25 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 07:11:25 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 07:11:26 INFO - Return code: 0 07:11:26 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-003', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test-pgo/build 07:11:26 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-003 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log 07:11:26 INFO - Using env: {'DISPLAY': ':0', 07:11:26 INFO - 'HOME': '/home/cltbld', 07:11:26 INFO - 'LANG': 'en_US.UTF-8', 07:11:26 INFO - 'LANGUAGE': 'en_US:en', 07:11:26 INFO - 'LOGNAME': 'cltbld', 07:11:26 INFO - 'MAIL': '/var/mail/cltbld', 07:11:26 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 07:11:26 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 07:11:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:11:26 INFO - 'MOZ_NO_REMOTE': '1', 07:11:26 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 07:11:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:11:26 INFO - 'NO_EM_RESTART': '1', 07:11:26 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:11:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:11:26 INFO - 'PWD': '/builds/slave/test-pgo', 07:11:26 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 07:11:26 INFO - 'SHELL': '/bin/bash', 07:11:26 INFO - 'SHLVL': '1', 07:11:26 INFO - 'TERM': 'linux', 07:11:26 INFO - 'TMOUT': '86400', 07:11:26 INFO - 'USER': 'cltbld', 07:11:26 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1459778890.312023-1948284489', 07:11:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:11:26 INFO - '_': '/tools/buildbot/bin/python'} 07:11:26 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-003', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 07:11:26 INFO - mozversion application_buildid: 20160404043017 07:11:26 INFO - mozversion application_changeset: 9bd90088875399347b05d87c67d3709e31539dcd 07:11:26 INFO - mozversion application_display_name: Nightly 07:11:26 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:11:26 INFO - mozversion application_name: Firefox 07:11:26 INFO - mozversion application_remotingname: firefox 07:11:26 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 07:11:26 INFO - mozversion application_vendor: Mozilla 07:11:26 INFO - mozversion application_version: 48.0a1 07:11:26 INFO - mozversion platform_buildid: 20160404043017 07:11:26 INFO - mozversion platform_changeset: 9bd90088875399347b05d87c67d3709e31539dcd 07:11:26 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 07:11:26 INFO - mozversion platform_version: 48.0a1 07:11:26 INFO - using testdate: 1459779086 07:11:26 INFO - actual date: 1459779086 07:11:26 INFO - starting webserver on 'localhost:33324' 07:11:26 INFO - SUITE-START | Running 2 tests 07:11:26 INFO - TEST-START | dromaeo_css 07:11:26 INFO - operating with platform_type : linux_ 07:11:26 INFO - Initialising browser for dromaeo_css test... 07:11:26 INFO - TEST-INFO | started process 10922 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpQV8MzX/profile http://localhost:33324/getInfo.html) 07:11:31 INFO - PROCESS | 10922 | 07:11:31 INFO - PROCESS | 10922 | (process:10989): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:11:31 INFO - PROCESS | 10922 | JavaScript error: jar:file:///builds/slave/test-pgo/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 07:11:32 INFO - PROCESS | 10922 | __metrics Screen width/height:1600/1200 07:11:32 INFO - PROCESS | 10922 | colorDepth:24 07:11:32 INFO - PROCESS | 10922 | Browser inner width/height: 1024/697 07:11:32 INFO - PROCESS | 10922 | __metrics 07:11:32 ERROR - PROCESS | 10922 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 07:11:33 INFO - TEST-INFO | 10922: exit 0 07:11:33 INFO - Browser initialized. 07:11:33 INFO - Running cycle 1/1 for dromaeo_css test... 07:11:33 INFO - TEST-INFO | started process 11040 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpQV8MzX/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:11:35 INFO - PROCESS | 11040 | 07:11:35 INFO - PROCESS | 11040 | (process:11101): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:11:45 INFO - PROCESS | 11040 | RSS: Main: 163307520 07:11:45 INFO - PROCESS | 11040 | 07:12:35 INFO - PROCESS | 11040 | 1459779155044 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] 07:14:42 INFO - PROCESS | 11040 | Cycle 1(1): loaded http://localhost:33324/tests/dromaeo/cssquery-dojo.html (next: http://localhost:33324/tests/dromaeo/cssquery-ext.html) 07:14:43 INFO - PROCESS | 11040 | RSS: Main: 168714240 07:14:43 INFO - PROCESS | 11040 | 07:17:45 INFO - PROCESS | 11040 | Cycle 1(1): loaded http://localhost:33324/tests/dromaeo/cssquery-ext.html (next: http://localhost:33324/tests/dromaeo/cssquery-jquery.html) 07:17:46 INFO - PROCESS | 11040 | RSS: Main: 165191680 07:17:46 INFO - PROCESS | 11040 | 07:20:47 INFO - PROCESS | 11040 | Cycle 1(1): loaded http://localhost:33324/tests/dromaeo/cssquery-jquery.html (next: http://localhost:33324/tests/dromaeo/cssquery-mootools.html) 07:20:48 INFO - PROCESS | 11040 | RSS: Main: 166502400 07:20:48 INFO - PROCESS | 11040 | 07:23:50 INFO - PROCESS | 11040 | Cycle 1(1): loaded http://localhost:33324/tests/dromaeo/cssquery-mootools.html (next: http://localhost:33324/tests/dromaeo/cssquery-prototype.html) 07:23:50 INFO - PROCESS | 11040 | RSS: Main: 163999744 07:23:50 INFO - PROCESS | 11040 | 07:26:53 INFO - PROCESS | 11040 | Cycle 1(1): loaded http://localhost:33324/tests/dromaeo/cssquery-prototype.html (next: http://localhost:33324/tests/dromaeo/cssquery-yui.html) 07:26:53 INFO - PROCESS | 11040 | RSS: Main: 164929536 07:26:53 INFO - PROCESS | 11040 | 07:29:55 INFO - PROCESS | 11040 | Cycle 1(1): loaded http://localhost:33324/tests/dromaeo/cssquery-yui.html (next: http://localhost:33324/tests/dromaeo/cssquery-dojo.html) 07:29:56 INFO - PROCESS | 11040 | RSS: Main: 167321600 07:29:56 INFO - PROCESS | 11040 | 07:29:56 INFO - PROCESS | 11040 | __start_tp_report 07:29:56 INFO - PROCESS | 11040 | _x_x_mozilla_page_load 07:29:56 INFO - PROCESS | 11040 | _x_x_mozilla_page_load_details 07:29:56 INFO - PROCESS | 11040 | |i|pagename|runs| 07:29:56 INFO - PROCESS | 11040 | |0;dojo.html;3104.6429660589033;3119.5476655884895;3136.6863313668623;3139.12104610709;3167.3506931079132;5074.5432911038;5109.003744269869;5209.817656382027;5220.817271395502;5272.630915835893;5173.741312934357;5243.606729495294;5354.946450535504;5361.088614935461;5414.864628384293;4529.5470452954605;4735.90528189436;4828.589569886564;4891.095147397725;4906.877328066791;4818.710877347353;4830.9033819323595;4843.878903027435;4851.054044461332;4894.5594896459315;4683.90632187356;4736.952630473703;4782.689125206885;4801.73590452525;4850.102730994742;4805.279208118775;4823.9517604824205;4829;4833.661643684944;4860.635452341088;4777.402824646919;4799.568038876518;4810.663253572251;4814.518548145193;4821.445533763592;5059.418166910816;5229.764660590283;5244.790208391698;5277.472252774692;5282.181261904411;5583.274174357308;5596.300462442195;5598.832035038955;5603.663780173162;5638.351589567212;5618.7190640468225;5628.71856407178;5636.830895073154;5649.23735295734;5680.261565996394;5396.865078373033;5415.296011518478;5448.37343705471;5483.204935284361;5498.120300751861;5823.155642431823;5849.64902105875;5871.119332100219;5877.794277200277;5879.559033072536;5473.370562385297;5635;5644.491995720405;5646;5655.773769049274;5641.464060914206;5650;5700.458456446631;5720.256366672306;5740.770369185269;5601.075822489325;5671.120976248688;5674.205611214434;5678.886422271531;5687.630304030225;5584.441555844383;5682.460166284196;5704.657720536781;5748.396418376094;5763;4315.611594956469;4332.4367832181615;4366.541513141138;4372.081862808782;4393.824247030083;3835.7314987950576;3870.9806450968126;3912.550056743454;3928.980355098206;3947.111899822517;5499.862503437366;5501.202325662756;5501.367342755554;5504.614676972574;5552.305961754781;5576.442355764391;5750.539956803445;5769.423057694281;5773.076307790733;5776.306843178845;5377.892442151135;5385.919211211835;5411.161270003156;5455.318085239345;5470.53500452466;4890.731009794425;4895.069936712013;4944.332515110486;4954.3063971044085;4969.801207951714;5698.458646428583;5780.913286300709;5874.236349274567;5891.528677705774;5900.291964964232;5687.914681279784;5737.368889422244;5741.684207368635;5774.566907481872;5797.420257974169;5842.38654941242;5853.414658534112;5853.473187412983;5857.974854400378;5863.648181109147;5457;5579.525740312119;5591.27313449249;5616.775328986795;5632.239647647515;5705.971470142623;5750.0512415450985;5760;5797.681127537857;5798.884022319615;5627.43725627434;5645.1532270159805;5651.915221271766;5657.745401456862;5672.262605861377;5508.44915508446;5547.306586676666;5585.273914391103;5606.074997625346;5635.830925072254;5482.17767334903;5496.725163741717;5508.366537848199;5526.889462210814;5575.944240557705;5566.721663916707;5600.523955463668;5622.662640241599;5627.943720562742;5638.915416268841;5397.7840886365675;5417.620766546304;5494.670319780826;5509.449055094458;5572.665640061609 07:29:56 INFO - PROCESS | 11040 | |1;ext.html;559.7845068872632;563.2086917880376;572.7651662818245;593.4747748242809;593.5993204586903;36506.63493365069;37193.44209836851;37353.43969840451;37392.43911341332;37433.25133497328;37566.624333756656;37964.24071518568;38001.80999095001;38089.42865857014;38143.427848582294;8394.664213431472;8581.013183483885;8587.828243435128;8598.097199794025;8613.698520551781;8468.915310846905;8709.390342676015;8721.345899057596;8777.824443511126;8791.824163516758;8755.3871229014;8757.124287571223;8835.690750823722;8846.336524760636;8870;8667.956660216722;8798.560071996375;8802.779930501725;8813.603387847563;8818;8699.565021748887;8814.647414103492;8821.426607270507;8832.293416526663;8850.070742572001;34411.31177376463;38639.42040869389;38831.22337553233;38841.223175536616;38872.61127388718;3385.4414021686393;3548.3258180945795;3600.4419315005953;3805.6955443564448;4422.181896349186;28610;28681.56977645337;28955.56566651502;29148;31465.528017079763;4219.367094935754;4259.403683484284;4292.055747735524;4379.605835474791;4412.382266482695;306479;309893;312237;312462;312530;47032.5296747035;64210.67894660497;64822.675886620265;64985.67507162529;65231;46219.306710399374;46629.76685116553;46989.76505117521;47177;47243;15820;15863.841361586236;15877.12675802819;16036.919815401081;16053.197340132947;12549.686257843445;12637.178583392233;12665.49338026487;12678.492860285669;12696.6825829355;16181.59546011359;16188;16210.297918718601;16217.756733649005;16284.348626055062;5863.765449381977;6045.153678485016;6170.352113028157;6263.404976527223;6304.779332723333;1077.5743581285349;1098.81869491533;1106.1372129738816;1142.177632104883;1188.9299630332596;31546.211344716565;31708.84145579257;31829.20426989344;32359;32454.188645283586;1115.8158903780948;1155.6648571914218;1197.1141355397117;1236.1285293867802;1259.3829023778283;16513.83486165147;16699.74950375745;16821.878934431163;16841.494755157364;17037.40369087076;412161;419830;421444;422136;422746;56991.430085699445;57827.4217257822;57866;57916;57939.13091303634;1366.2075995922341;1374.4433504430722;1390.1311680199874;1405.9648508787157;1430.81399418075;31305.217369565944;31499;31565.526517101804;32276;32399.51400729038;50823;51144.48855511546;51194.232086517986;51358.74320628373;51631;380551;381802;386156;387098;389493;36610.8169459151;36932;37295.44056839095;37467.62532374641;37541.24917501689;49111;49324.506754931994;50282.497175029246;51090.233646496075;52085.47914520958;37114;37318;37773.81113094417;37808;38241;36807.44788828116;40521.79739101286;44484.77757611191;44890;46972.7651361741;41865.37201942034;47401;47407.76296118497;47865;48668.513314866395;35645.643543564234;35848.82075589606;35865.87330483798;36076.4588531167;36295;27987.300317492227;28617.28456788597;28702;28742.856285718437;28986.42027159487 07:29:56 INFO - PROCESS | 11040 | |2;jquery.html;350.42005480929066;358.27270640599573;364.7811313212073;374.18427827336393;375.42934739196403;17039.233234504445;17489.475315740532;17955.461336159904;17971.10144492775;17989.550261243476;16674.749878751827;17163.485095447126;17241.827581724177;17361.7395739064;17364.21861016254;5196.090684130281;5328.5470734987375;5473.67157970523;5476.479734425223;5496.0931446311315;5447.319085114361;5503.257060296869;5508.6970216638065;5515.696636684981;5522.171674248854;5273.604479664022;5423.132298832187;5445.401005889349;5450;5513.09034009388;5283.313169288006;5336.786528538853;5364.812231571896;5368.946310536923;5380.139177731544;4733.621310295168;4771.522847715235;4789.592884604813;4897.314375987365;4901.3383193269165;21140;21367.35897923065;21711.34865954024;21755.12979480819;21865.12539498418;2387.2838148555365;2519.44572194117;2551.9489610207693;2668.9599656005175;3075.784695071346;13794.586162415144;13894.444222231099;13920.860791392159;14118.223497707622;14206.289685515683;1843.382466873599;1856.4616261284345;1979.5051237190703;2009.0959068419124;2046.2531176120608;65742.67128664374;65886.67056664734;66041.339586604;68176.31823681749;69243.65378173128;9930.553125109387;10097.646582369582;10224.386536807815;10387.896121038844;10480.266381353233;13965.441382344592;14019.439222430989;14024.667656572608;14100.85899141016;14107.36516856744;7286.817829554304;7518.28576285252;7650.2349765023055;7759.72840950564;8077.8788318175275;7273.3817625502425;7557;7703.383729301754;7779.144294127642;7934.761957141295;4498.865034048984;4499.752513611717;4502.954970450253;4581.152486789954;4598.218302888517;1707.8036025856936;1888.9149988250563;1913.1773337464745;1934.1586409911733;1975.4764987278384;908.8046070094962;997.6308765756717;998.1054940672109;1098.4343063322394;1152.2740673375888;17611.647767044844;17644.294228230727;18081.186346614435;18120.546986325448;18325.7251141233;1012.8885822559513;1025.4308858583559;1056.3292309383596;1062.0972173652333;1071.2982996137541;10192.388456692473;10252.64115755945;10305.94847025775;10325.793484130276;10454.425006624557;488890;488917;494996;509077;509134;80029;81983.59008204921;83653.16346836576;84052;84062.15937840665;1033.6692258477365;1053.1101219469535;1054.514923135351;1055.482813421418;1088.6298658456005;15696.686066278382;15799.842001579837;16122.355105795637;16225.756613651041;16606.83393166101;34281.657183427844;36978.815105924295;37436;38571.22857542778;39728.404073938334;50623.74688126683;50872;51061.23408148955;51171.232431514305;51631.48368516417;7677.500962437423;7886.369090472634;7889.408294377829;7967.84064318722;8016.038075430985;12526.624201273977;12645.810312845131;12658.936705316415;12800.487980480677;12819.359032048547;11054.502547385226;11546.59586914454;11714;11748.29510229389;11880.108991825475;7169.677364518713;11210.775784484102;11295.152863535432;11305.26515776472;11320.830187547359;11373.772524549628;11633;11826.82259766087;11846.703832403915;11928.76142477163;7863.449558530848;7869.921300786918;7939.245771651684;7966.681332746625;8052.396070294869;11046.723831904266;11567.479463423997;11641.41792910368;12150.331731754839;12177 07:29:56 INFO - PROCESS | 11040 | |3;mootools.html;1497.1167011463237;1507.4196434372764;1690.391459074733;1807.9005654688988;1818.6271814278075;7033.50765446419;7552.131504876941;7662.6551805168765;7846.333061689763;7850.725224617139;7584;7586.962065189667;7629.275218854214;7653.464257501977;7680.423968202394;2214.092222188907;2286.27982185611;2294.8737819419925;2302.9884850575722;2317.212147869724;2312.895919683618;2331.079223706635;2356.6229403295474;2363.0547780887696;2364.4916342986253;2269.3986093685185;2274.65880117982;2306.319635707462;2311.7572654871246;2327.150590034642;2201.559688062394;2319.761430219846;2369.0168580039262;2383.7020372453444;2384.3681424422543;2363.5981883079917;2366.4675448024227;2375.7267914189915;2386.809055275574;2394.844335118229;7908.485948413335;7916.575016497029;7953.323967462715;7956.28393444587;7965.96017019917;4958.752062396866;5080.669756465818;5103.055934652064;5114.232865070232;5114.514121158484;3235.8705651773903;3332.2002719347424;3391.6438773928876;3409.5226668266464;3422.760406771527;1187.6912002879228;1220.1032241302635;1220.1093201962617;1230.5077968812457;1246.464020471197;10629.362238265652;10811.459427028618;10843.566257349696;10865.565377384895;10897.83653245194;4368;4408.382826404306;4416.116776644684;4440.62254708347;4534.387857639243;9290.1174388433;9341.065893410605;9343.672971446103;9363.765905852271;9399.24806015517;5048.798048078036;5074.619403544749;5077.111505486525;5085.262636917626;5102.897942041139;4126.360414135814;4447.644188464915;4584.587387135174;4627.606653434428;4667.556582124693;3707.1658876752513;3731.2910546995986;3765.4163604641326;3793.430985352219;3797.1266608680157;1192.1237890150733;1198.7063169523349;1251.0679543739973;1251.418090587881;1264.6016504800957;1391.3530208452914;1414.4625042483997;1417.9351504641588;1428.6428392901776;1438.6115748747989;7324.853502929912;7346.63266836656;7389.482736208522;7390.334869861738;7407.740729074457;486.2584558548242;503.1948881789181;506.42014892947367;509.35057801302895;512.1140427061131;5861.17943487912;5876.471117599351;5919.467247947706;5929.851753706192;5930.851728706817;9003.234725048444;9533.570989305497;9601.759956001017;9673.903260967441;9676.806463870824;9411.152996230372;9459.858102128474;9551.856722149174;9554.90445095554;9589.089036541518;7118.679659415338;7458;7463.9626801866725;7475.327220550285;7528.548287102792;7201.063861697946;7252.5648461092505;7348.96325518369;7350;7360.631968401665;8377.916220837957;8478.448900821428;8489.40574159803;8550.1449855014;8668.219860212612;8590.785230369042;8722.171393717586;8776.517291549026;8817.294616430541;8826.691065812665;6239.0953311768635;6517.055027020961;6682.63245521501;7030.964845175741;7133.6076515790055;7302.817429564091;7391.963040184764;7394.482386233127;7438.40492760567;7452.105747310357;6724.8991265132045;6783.660816959034;6864;6923.653817309215;7007.964960175166;6534.542582019213;6597.6701164940605;6635.568688035262;6640.369164929324;6783.18601767791;6885.552439091443;6891.241963383924;6968.79093627192;6973.16322041338;6973.860522789617;6574.3754343337305;6686.53194276396;6692.866142677217;6710.362515561014;6734.595924244561;6622.8344291393105;6731.629760363227;6752.257251702211;6757.628330441873;6759.86480270382 07:29:56 INFO - PROCESS | 11040 | |4;prototype.html;344.1877169879085;346.22618447769247;347.15987310708084;351.40787772603164;354.71977138060925;6338.714757835897;6357.1417858589075;6381.5851969621945;6452.7096280667365;6456.225252969644;6291.496680265579;6298.149749783778;6300.905486417708;6305.779297724581;6306.463950564207;4578.084383123372;4664.790084446208;4700;4709.576138147566;4777.52224777522;4680.882977925545;4685.1332503486965;4699.812007519695;4702.3416721659;4715.1512727709;4641.512641172679;4643.512431194727;4667.813287468497;4684.156851766681;4709.976450117744;4715.552022557851;4724.811007559693;4725.267583524559;4729.9054018919605;4733.644976626767;4107.815148318333;4109.938350924738;4111;4114.156597897424;4115.42384066231;6131.724072416708;6137.202163718733;6142.170806941095;6164.7534098636;6165.260168779775;5387.1111266640955;5582.246396736429;5589.860253493654;5590.413006634326;5591.2731344925305;6694.59832410057;6711.9664401678165;6725.865482690368;6730.495212859007;6739.730410783563;4559.521250268707;4593.931091033637;4597.954020459786;4602.746848923308;4605.078984203139;7014.964925175393;7066.152061752623;7067.964660176717;7071.964640176766;7092.893606595905;4525.117602067565;4687.968646897677;4703.176944034849;4705.388299521041;4715.7877895494785;4736.715797052188;4753.04939012199;4756.048790241965;4763.499832517605;4779.761011949388;5525.778968841281;5546.722663866791;5567.526760225345;5572.554195664337;5576.275084239023;6826.556273842284;6827.658617069127;6827.658617069226;6834.2482326944;6839.008343790122;1641.9917900410421;1680.579855036241;1681.2434404518017;1683.099541745185;1683.4276346042404;1050.653284416156;1092.4264761000538;1093.8359246112987;1102.5865300512307;1102.72431892027;6558.737650494022;6568.704408301638;6578.769743059066;6592.604443733391;6592.8351791205605;6978.092847929736;7023.262557431396;7043.788686339418;7050.435965122778;7067.116610423697;6302.590331628429;6414.1340918976275;6516.934830651633;6575.046618240328;6643.60138391698;3795.791231482295;3831.7126215533945;3832.9041773955873;3834.750741201813;3841.385378339508;7235.710571577183;7279.854402911912;7290.854182916418;7295.52579082358;7301.926980730231;7193.280671932765;7197.964010179916;7215.567065976058;7242.9275707243305;7248.855022899513;7094.893576596355;7301.37938275242;7308.926910730931;7308.96345518269;7311.159216690149;7048.400885924754;7060.929390706027;7065.434765218667;7088.893666595109;7094.893576596459;6916.066331045245;6997.545159564612;7001.194862590663;7017.578945263301;7030.4024157945105;7289.927100728924;7302.525335853153;7305.196428392766;7307.086614173229;7310.159331676712;4520.163769702615;4680.859574212779;4695.0375173090115;4699.389079419653;4705.717656940595;6929.237783843874;6941.722331106699;6973.79078627642;6984.965075174591;7000.124984376953;6724.226713927766;6754.358335958076;6764.425023873026;6788.898166527605;6797.864042719217;6678.799636010927;6688.899666504909;6703.128593282842;6703.731850725916;6718.428933540704;6483.513736469689;6617.2721000688925;6623.768168114093;6628.27089020217;6646.767363142267;6731.596104233761;6779.796606101825;6816.795496135124;6820.113385259884;6823;6545.836354090995;6600.504962127764;6613.834654133685;6620.271770105188;6630.668466576748 07:29:56 INFO - PROCESS | 11040 | |5;yui.html;745.2956955676881;791.4499422901082;835.9874601880973;839.4459656626626;860.969866054688;12991.545295914644;13099;13123.409446574904;13205.207687538754;13243.006774491903;13055.281959492224;13253.668658283523;13254.337283135828;13258.535951241709;13271.137376070548;714.546263122918;811.9188081191863;859.256742917375;861.6424183963647;864.9610767515445;854.3763052971335;855.1918437076964;857.2841677199546;857.8412993596205;860.5697151424288;882.6469412235093;885.8538341173698;889.4663202078733;893.4371346052011;897.7755561109723;883.9381243312971;885.3050355470924;889.204162274767;891.3983061433539;892.433304851424;651.6188030002454;651.7523341130387;654.2410803467955;654.2966311215463;656.727458104886;12882.291473968928;12899.226046437243;12918.22490650564;13214.471421143238;13256.20462772227;14248;14283;14406.351714172888;14477.493287734878;14543.127412355292;11438.084953203725;11462;11479.25384849982;11522.193446458752;11522.942385288105;4486.226628022035;4554.407926969473;4579.542045795394;4584.7478388688605;4705.505921878222;52065.73967130178;52500.474995249555;52884.47115528834;52892.73553632207;53263.73368133173;10071.798564028679;10348.896511034944;10384.117350025332;10475.319104258198;10482.63310784119;18162.45512634623;18204.63590728178;18230.45308640743;18244.63510729778;18271.36050238235;7949.960250198712;8060;8073.555954422563;8173.95913020443;8196.467229630054;4626.329182268552;4686.835960741358;4739.312799644102;4797.880052998703;4809.062232864558;3384.390809654237;3408.9602671185526;3431.742619303562;3433.1073920780777;3434.4676575130893;604.2507290959179;613.6195558753601;619.3651507205151;623.3517142172091;630.168178005029;646.2568046746186;648.8280605639509;665.1851481934688;666.3136968922018;707.3739740329743;9212.170904618617;9245.676401325922;9312.767180820398;9375;9533.570989305497;585.5227989188883;647.9956068094529;687.2646268492765;692.5221597097986;702.68379229347;4066.532348779869;4146.543880173179;4224.619784219435;4278.016056307005;4366.017646029618;64397;64972;65254;65735.67132164404;67131.32868671349;54136;54675.72662136664;54898.45101549013;55078.72460637752;55134.448655513734;53978.46021539813;54398.45601544013;54567;54576.72711636496;55310;8078.757637270891;8110.432269741062;8251.133630968661;8345.290650294794;8446.873296900674;39122;39871.2025759489;40469.797651011555;40580.3912941312;40800;51739.48260517497;53022;53119.20321195263;53350.199747004604;53996.46003539914;10396.844047339144;10514.369137851447;10586.89413105859;10678.412687301961;10726.517306721373;10803.945980270048;11131.554737810397;11184.720381990515;11286.717832054264;11367.20429569922;11074.5570177192;11116.11071114325;11218.55125794959;11235.438228088726;11792.056635469313;10434.21743369235;10590.523426445674;10645.946770266099;10766.623168189075;10988.780224395627;10719.828339030353;10889.346639201673;10926.180536459957;10930.890691092987;11283.492242849255;8710.346723995599;8713.346499012727;8829.69096081634;8900.287976961697;8974.641014359353;9089.909100908906;9102.635894564144;9171.082891710776;9259.67591134307;9416.964133945397 07:29:56 INFO - PROCESS | 11040 | __end_tp_report 07:29:56 INFO - PROCESS | 11040 | __start_cc_report 07:29:56 INFO - PROCESS | 11040 | _x_x_mozilla_cycle_collect,340 07:29:56 INFO - PROCESS | 11040 | __end_cc_report 07:29:56 INFO - PROCESS | 11040 | __startTimestamp1459780196003__endTimestamp 07:29:56 INFO - PROCESS | 11040 | 07:29:56 INFO - PROCESS | 11040 | ------- Summary: start ------- 07:29:56 INFO - PROCESS | 11040 | Number of tests: 6 07:29:56 INFO - PROCESS | 11040 | 07:29:56 INFO - PROCESS | 11040 | [#0] dojo.html Cycles:165 Average:5289.07 Median:5508.45 stddev:599.63 (10.9%) stddev-sans-first:576.47 07:29:56 INFO - PROCESS | 11040 | Values: 3104.6 3119.5 3136.7 3139.1 3167.4 5074.5 5109.0 5209.8 5220.8 5272.6 5173.7 5243.6 5354.9 5361.1 5414.9 4529.5 4735.9 4828.6 4891.1 4906.9 4818.7 4830.9 4843.9 4851.1 4894.6 4683.9 4737.0 4782.7 4801.7 4850.1 4805.3 4824.0 4829.0 4833.7 4860.6 4777.4 4799.6 4810.7 4814.5 4821.4 5059.4 5229.8 5244.8 5277.5 5282.2 5583.3 5596.3 5598.8 5603.7 5638.4 5618.7 5628.7 5636.8 5649.2 5680.3 5396.9 5415.3 5448.4 5483.2 5498.1 5823.2 5849.6 5871.1 5877.8 5879.6 5473.4 5635.0 5644.5 5646.0 5655.8 5641.5 5650.0 5700.5 5720.3 5740.8 5601.1 5671.1 5674.2 5678.9 5687.6 5584.4 5682.5 5704.7 5748.4 5763.0 4315.6 4332.4 4366.5 4372.1 4393.8 3835.7 3871.0 3912.6 3929.0 3947.1 5499.9 5501.2 5501.4 5504.6 5552.3 5576.4 5750.5 5769.4 5773.1 5776.3 5377.9 5385.9 5411.2 5455.3 5470.5 4890.7 4895.1 4944.3 4954.3 4969.8 5698.5 5780.9 5874.2 5891.5 5900.3 5687.9 5737.4 5741.7 5774.6 5797.4 5842.4 5853.4 5853.5 5858.0 5863.6 5457.0 5579.5 5591.3 5616.8 5632.2 5706.0 5750.1 5760.0 5797.7 5798.9 5627.4 5645.2 5651.9 5657.7 5672.3 5508.4 5547.3 5585.3 5606.1 5635.8 5482.2 5496.7 5508.4 5526.9 5575.9 5566.7 5600.5 5622.7 5627.9 5638.9 5397.8 5417.6 5494.7 5509.4 5572.7 07:29:56 INFO - PROCESS | 11040 | 07:29:56 INFO - PROCESS | 11040 | [#1] ext.html Cycles:180 Average:53930.26 Median:209972.71 stddev:98626.31 (47.0%) stddev-sans-first:98821.58 07:29:56 INFO - PROCESS | 11040 | Values: 559.8 563.2 572.8 593.5 593.6 36506.6 37193.4 37353.4 37392.4 37433.3 37566.6 37964.2 38001.8 38089.4 38143.4 8394.7 8581.0 8587.8 8598.1 8613.7 8468.9 8709.4 8721.3 8777.8 8791.8 8755.4 8757.1 8835.7 8846.3 8870.0 8668.0 8798.6 8802.8 8813.6 8818.0 8699.6 8814.6 8821.4 8832.3 8850.1 34411.3 38639.4 38831.2 38841.2 38872.6 3385.4 3548.3 3600.4 3805.7 4422.2 28610.0 28681.6 28955.6 29148.0 31465.5 4219.4 4259.4 4292.1 4379.6 4412.4 306479.0 309893.0 312237.0 312462.0 312530.0 47032.5 64210.7 64822.7 64985.7 65231.0 46219.3 46629.8 46989.8 47177.0 47243.0 15820.0 15863.8 15877.1 16036.9 16053.2 12549.7 12637.2 12665.5 12678.5 12696.7 16181.6 16188.0 16210.3 16217.8 16284.3 5863.8 6045.2 6170.4 6263.4 6304.8 1077.6 1098.8 1106.1 1142.2 1188.9 31546.2 31708.8 31829.2 32359.0 32454.2 1115.8 1155.7 1197.1 1236.1 1259.4 16513.8 16699.7 16821.9 16841.5 17037.4 412161.0 419830.0 421444.0 422136.0 422746.0 56991.4 57827.4 57866.0 57916.0 57939.1 1366.2 1374.4 1390.1 1406.0 1430.8 31305.2 31499.0 31565.5 32276.0 32399.5 50823.0 51144.5 51194.2 51358.7 51631.0 380551.0 381802.0 386156.0 387098.0 389493.0 36610.8 36932.0 37295.4 37467.6 37541.2 49111.0 49324.5 50282.5 51090.2 52085.5 37114.0 37318.0 37773.8 37808.0 38241.0 36807.4 40521.8 44484.8 44890.0 46972.8 41865.4 47401.0 47407.8 47865.0 48668.5 35645.6 35848.8 35865.9 36076.5 36295.0 27987.3 28617.3 28702.0 28742.9 28986.4 07:29:56 INFO - PROCESS | 11040 | 07:29:56 INFO - PROCESS | 11040 | [#2] jquery.html Cycles:180 Average:27938.10 Median:2453.36 stddev:81690.90 (3329.7%) stddev-sans-first:81893.80 07:29:56 INFO - PROCESS | 11040 | Values: 350.4 358.3 364.8 374.2 375.4 17039.2 17489.5 17955.5 17971.1 17989.6 16674.7 17163.5 17241.8 17361.7 17364.2 5196.1 5328.5 5473.7 5476.5 5496.1 5447.3 5503.3 5508.7 5515.7 5522.2 5273.6 5423.1 5445.4 5450.0 5513.1 5283.3 5336.8 5364.8 5368.9 5380.1 4733.6 4771.5 4789.6 4897.3 4901.3 21140.0 21367.4 21711.3 21755.1 21865.1 2387.3 2519.4 2551.9 2669.0 3075.8 13794.6 13894.4 13920.9 14118.2 14206.3 1843.4 1856.5 1979.5 2009.1 2046.3 65742.7 65886.7 66041.3 68176.3 69243.7 9930.6 10097.6 10224.4 10387.9 10480.3 13965.4 14019.4 14024.7 14100.9 14107.4 7286.8 7518.3 7650.2 7759.7 8077.9 7273.4 7557.0 7703.4 7779.1 7934.8 4498.9 4499.8 4503.0 4581.2 4598.2 1707.8 1888.9 1913.2 1934.2 1975.5 908.8 997.6 998.1 1098.4 1152.3 17611.6 17644.3 18081.2 18120.5 18325.7 1012.9 1025.4 1056.3 1062.1 1071.3 10192.4 10252.6 10305.9 10325.8 10454.4 488890.0 488917.0 494996.0 509077.0 509134.0 80029.0 81983.6 83653.2 84052.0 84062.2 1033.7 1053.1 1054.5 1055.5 1088.6 15696.7 15799.8 16122.4 16225.8 16606.8 34281.7 36978.8 37436.0 38571.2 39728.4 50623.7 50872.0 51061.2 51171.2 51631.5 7677.5 7886.4 7889.4 7967.8 8016.0 12526.6 12645.8 12658.9 12800.5 12819.4 11054.5 11546.6 11714.0 11748.3 11880.1 7169.7 11210.8 11295.2 11305.3 11320.8 11373.8 11633.0 11826.8 11846.7 11928.8 7863.4 7869.9 7939.2 7966.7 8052.4 11046.7 11567.5 11641.4 12150.3 12177.0 07:29:56 INFO - PROCESS | 11040 | 07:29:56 INFO - PROCESS | 11040 | [#3] mootools.html Cycles:180 Average:5538.82 Median:6378.08 stddev:2831.47 (44.4%) stddev-sans-first:2823.12 07:29:56 INFO - PROCESS | 11040 | Values: 1497.1 1507.4 1690.4 1807.9 1818.6 7033.5 7552.1 7662.7 7846.3 7850.7 7584.0 7587.0 7629.3 7653.5 7680.4 2214.1 2286.3 2294.9 2303.0 2317.2 2312.9 2331.1 2356.6 2363.1 2364.5 2269.4 2274.7 2306.3 2311.8 2327.2 2201.6 2319.8 2369.0 2383.7 2384.4 2363.6 2366.5 2375.7 2386.8 2394.8 7908.5 7916.6 7953.3 7956.3 7966.0 4958.8 5080.7 5103.1 5114.2 5114.5 3235.9 3332.2 3391.6 3409.5 3422.8 1187.7 1220.1 1220.1 1230.5 1246.5 10629.4 10811.5 10843.6 10865.6 10897.8 4368.0 4408.4 4416.1 4440.6 4534.4 9290.1 9341.1 9343.7 9363.8 9399.2 5048.8 5074.6 5077.1 5085.3 5102.9 4126.4 4447.6 4584.6 4627.6 4667.6 3707.2 3731.3 3765.4 3793.4 3797.1 1192.1 1198.7 1251.1 1251.4 1264.6 1391.4 1414.5 1417.9 1428.6 1438.6 7324.9 7346.6 7389.5 7390.3 7407.7 486.3 503.2 506.4 509.4 512.1 5861.2 5876.5 5919.5 5929.9 5930.9 9003.2 9533.6 9601.8 9673.9 9676.8 9411.2 9459.9 9551.9 9554.9 9589.1 7118.7 7458.0 7464.0 7475.3 7528.5 7201.1 7252.6 7349.0 7350.0 7360.6 8377.9 8478.4 8489.4 8550.1 8668.2 8590.8 8722.2 8776.5 8817.3 8826.7 6239.1 6517.1 6682.6 7031.0 7133.6 7302.8 7392.0 7394.5 7438.4 7452.1 6724.9 6783.7 6864.0 6923.7 7008.0 6534.5 6597.7 6635.6 6640.4 6783.2 6885.6 6891.2 6968.8 6973.2 6973.9 6574.4 6686.5 6692.9 6710.4 6734.6 6622.8 6731.6 6752.3 6757.6 6759.9 07:29:56 INFO - PROCESS | 11040 | 07:29:56 INFO - PROCESS | 11040 | [#4] prototype.html Cycles:180 Average:5631.47 Median:6454.47 stddev:1742.65 (27.0%) stddev-sans-first:1701.75 07:29:56 INFO - PROCESS | 11040 | Values: 344.2 346.2 347.2 351.4 354.7 6338.7 6357.1 6381.6 6452.7 6456.2 6291.5 6298.1 6300.9 6305.8 6306.5 4578.1 4664.8 4700.0 4709.6 4777.5 4680.9 4685.1 4699.8 4702.3 4715.2 4641.5 4643.5 4667.8 4684.2 4710.0 4715.6 4724.8 4725.3 4729.9 4733.6 4107.8 4109.9 4111.0 4114.2 4115.4 6131.7 6137.2 6142.2 6164.8 6165.3 5387.1 5582.2 5589.9 5590.4 5591.3 6694.6 6712.0 6725.9 6730.5 6739.7 4559.5 4593.9 4598.0 4602.7 4605.1 7015.0 7066.2 7068.0 7072.0 7092.9 4525.1 4688.0 4703.2 4705.4 4715.8 4736.7 4753.0 4756.0 4763.5 4779.8 5525.8 5546.7 5567.5 5572.6 5576.3 6826.6 6827.7 6827.7 6834.2 6839.0 1642.0 1680.6 1681.2 1683.1 1683.4 1050.7 1092.4 1093.8 1102.6 1102.7 6558.7 6568.7 6578.8 6592.6 6592.8 6978.1 7023.3 7043.8 7050.4 7067.1 6302.6 6414.1 6516.9 6575.0 6643.6 3795.8 3831.7 3832.9 3834.8 3841.4 7235.7 7279.9 7290.9 7295.5 7301.9 7193.3 7198.0 7215.6 7242.9 7248.9 7094.9 7301.4 7308.9 7309.0 7311.2 7048.4 7060.9 7065.4 7088.9 7094.9 6916.1 6997.5 7001.2 7017.6 7030.4 7289.9 7302.5 7305.2 7307.1 7310.2 4520.2 4680.9 4695.0 4699.4 4705.7 6929.2 6941.7 6973.8 6985.0 7000.1 6724.2 6754.4 6764.4 6788.9 6797.9 6678.8 6688.9 6703.1 6703.7 6718.4 6483.5 6617.3 6623.8 6628.3 6646.8 6731.6 6779.8 6816.8 6820.1 6823.0 6545.8 6600.5 6613.8 6620.3 6630.7 07:29:56 INFO - PROCESS | 11040 | 07:29:56 INFO - PROCESS | 11040 | [#5] yui.html Cycles:180 Average:14911.37 Median:53070.60 stddev:18177.01 (34.3%) stddev-sans-first:18196.88 07:29:56 INFO - PROCESS | 11040 | Values: 745.3 791.4 836.0 839.4 861.0 12991.5 13099.0 13123.4 13205.2 13243.0 13055.3 13253.7 13254.3 13258.5 13271.1 714.5 811.9 859.3 861.6 865.0 854.4 855.2 857.3 857.8 860.6 882.6 885.9 889.5 893.4 897.8 883.9 885.3 889.2 891.4 892.4 651.6 651.8 654.2 654.3 656.7 12882.3 12899.2 12918.2 13214.5 13256.2 14248.0 14283.0 14406.4 14477.5 14543.1 11438.1 11462.0 11479.3 11522.2 11522.9 4486.2 4554.4 4579.5 4584.7 4705.5 52065.7 52500.5 52884.5 52892.7 53263.7 10071.8 10348.9 10384.1 10475.3 10482.6 18162.5 18204.6 18230.5 18244.6 18271.4 7950.0 8060.0 8073.6 8174.0 8196.5 4626.3 4686.8 4739.3 4797.9 4809.1 3384.4 3409.0 3431.7 3433.1 3434.5 604.3 613.6 619.4 623.4 630.2 646.3 648.8 665.2 666.3 707.4 9212.2 9245.7 9312.8 9375.0 9533.6 585.5 648.0 687.3 692.5 702.7 4066.5 4146.5 4224.6 4278.0 4366.0 64397.0 64972.0 65254.0 65735.7 67131.3 54136.0 54675.7 54898.5 55078.7 55134.4 53978.5 54398.5 54567.0 54576.7 55310.0 8078.8 8110.4 8251.1 8345.3 8446.9 39122.0 39871.2 40469.8 40580.4 40800.0 51739.5 53022.0 53119.2 53350.2 53996.5 10396.8 10514.4 10586.9 10678.4 10726.5 10803.9 11131.6 11184.7 11286.7 11367.2 11074.6 11116.1 11218.6 11235.4 11792.1 10434.2 10590.5 10645.9 10766.6 10988.8 10719.8 10889.3 10926.2 10930.9 11283.5 8710.3 8713.3 8829.7 8900.3 8974.6 9089.9 9102.6 9171.1 9259.7 9417.0 07:29:56 INFO - PROCESS | 11040 | -------- Summary: end -------- 07:29:56 INFO - PROCESS | 11040 | 07:29:56 INFO - TEST-INFO | 11040: exit 0 07:29:56 INFO - TEST-OK | dromaeo_css | took 1109822ms 07:29:56 INFO - TEST-START | kraken 07:29:56 INFO - operating with platform_type : linux_ 07:29:56 INFO - Initialising browser for kraken test... 07:29:56 INFO - TEST-INFO | started process 11284 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpMigNDK/profile http://localhost:33324/getInfo.html) 07:30:00 INFO - PROCESS | 11284 | 07:30:00 INFO - PROCESS | 11284 | (process:11350): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:30:00 INFO - PROCESS | 11284 | JavaScript error: jar:file:///builds/slave/test-pgo/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 07:30:01 INFO - PROCESS | 11284 | __metrics Screen width/height:1600/1200 07:30:01 INFO - PROCESS | 11284 | colorDepth:24 07:30:01 INFO - PROCESS | 11284 | Browser inner width/height: 1024/697 07:30:01 INFO - PROCESS | 11284 | __metrics 07:30:01 ERROR - PROCESS | 11284 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 07:30:02 INFO - TEST-INFO | 11284: exit 0 07:30:02 INFO - Browser initialized. 07:30:02 INFO - Running cycle 1/1 for kraken test... 07:30:02 INFO - TEST-INFO | started process 11406 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpMigNDK/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:30:04 INFO - PROCESS | 11406 | 07:30:04 INFO - PROCESS | 11406 | (process:11465): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:30:14 INFO - PROCESS | 11406 | RSS: Main: 163323904 07:30:14 INFO - PROCESS | 11406 | 07:30:16 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:33324/tests/kraken/driver.html?testName=audio-beat-detection) 07:30:17 INFO - PROCESS | 11406 | RSS: Main: 167890944 07:30:17 INFO - PROCESS | 11406 | 07:30:20 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:33324/tests/kraken/driver.html?testName=audio-dft) 07:30:20 INFO - PROCESS | 11406 | RSS: Main: 171028480 07:30:20 INFO - PROCESS | 11406 | 07:30:23 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:33324/tests/kraken/driver.html?testName=audio-fft) 07:30:24 INFO - PROCESS | 11406 | RSS: Main: 161210368 07:30:24 INFO - PROCESS | 11406 | 07:30:26 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:33324/tests/kraken/driver.html?testName=audio-oscillator) 07:30:26 INFO - PROCESS | 11406 | RSS: Main: 161710080 07:30:26 INFO - PROCESS | 11406 | 07:30:29 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:33324/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:30:29 INFO - PROCESS | 11406 | RSS: Main: 162992128 07:30:29 INFO - PROCESS | 11406 | 07:30:32 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:33324/tests/kraken/driver.html?testName=imaging-darkroom) 07:30:33 INFO - PROCESS | 11406 | RSS: Main: 164003840 07:30:33 INFO - PROCESS | 11406 | 07:30:36 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:33324/tests/kraken/driver.html?testName=imaging-desaturate) 07:30:37 INFO - PROCESS | 11406 | RSS: Main: 164024320 07:30:37 INFO - PROCESS | 11406 | 07:30:40 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:33324/tests/kraken/driver.html?testName=json-parse-financial) 07:30:40 INFO - PROCESS | 11406 | RSS: Main: 165908480 07:30:40 INFO - PROCESS | 11406 | 07:30:42 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:33324/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:30:42 INFO - PROCESS | 11406 | RSS: Main: 165842944 07:30:42 INFO - PROCESS | 11406 | 07:30:44 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:33324/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:30:45 INFO - PROCESS | 11406 | RSS: Main: 165117952 07:30:45 INFO - PROCESS | 11406 | 07:30:47 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:33324/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:30:47 INFO - PROCESS | 11406 | RSS: Main: 165642240 07:30:47 INFO - PROCESS | 11406 | 07:30:50 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:33324/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:30:51 INFO - PROCESS | 11406 | RSS: Main: 166019072 07:30:51 INFO - PROCESS | 11406 | 07:30:53 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:33324/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:30:54 INFO - PROCESS | 11406 | RSS: Main: 166088704 07:30:54 INFO - PROCESS | 11406 | 07:30:55 INFO - PROCESS | 11406 | Cycle 1(1): loaded http://localhost:33324/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:33324/tests/kraken/driver.html?testName=ai-astar) 07:30:56 INFO - PROCESS | 11406 | RSS: Main: 167923712 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | __start_tp_report 07:30:56 INFO - PROCESS | 11406 | _x_x_mozilla_page_load 07:30:56 INFO - PROCESS | 11406 | _x_x_mozilla_page_load_details 07:30:56 INFO - PROCESS | 11406 | |i|pagename|runs| 07:30:56 INFO - PROCESS | 11406 | |0;ai-astar;111;105;112;110;112;124;111;110;110;111 07:30:56 INFO - PROCESS | 11406 | |1;audio-beat-detection;155;128;157;170;132;160;158;130;170;132 07:30:56 INFO - PROCESS | 11406 | |2;audio-dft;162;163;163;162;162;163;162;169;170;164 07:30:56 INFO - PROCESS | 11406 | |3;audio-fft;77;77;76;77;76;73;76;73;155;76 07:30:56 INFO - PROCESS | 11406 | |4;audio-oscillator;92;93;132;93;93;93;149;93;93;142 07:30:56 INFO - PROCESS | 11406 | |5;imaging-gaussian-blur;118;117;117;118;118;117;117;118;117;118 07:30:56 INFO - PROCESS | 11406 | |6;imaging-darkroom;145;147;146;146;146;147;148;147;148;146 07:30:56 INFO - PROCESS | 11406 | |7;imaging-desaturate;96;96;96;98;95;96;96;96;96;96 07:30:56 INFO - PROCESS | 11406 | |8;json-parse-financial;62;58;62;58;61;58;58;60;57;58 07:30:56 INFO - PROCESS | 11406 | |9;json-stringify-tinderbox;61;63;61;61;61;62;60;60;60;60 07:30:56 INFO - PROCESS | 11406 | |10;stanford-crypto-aes;81;82;81;82;81;80;89;80;80;79 07:30:56 INFO - PROCESS | 11406 | |11;stanford-crypto-ccm;117;117;115;123;123;115;113;130;116;121 07:30:56 INFO - PROCESS | 11406 | |12;stanford-crypto-pbkdf2;135;147;147;149;144;145;148;145;153;139 07:30:56 INFO - PROCESS | 11406 | |13;stanford-crypto-sha256-iterative;65;64;69;71;66;65;64;64;69;66 07:30:56 INFO - PROCESS | 11406 | __end_tp_report 07:30:56 INFO - PROCESS | 11406 | __start_cc_report 07:30:56 INFO - PROCESS | 11406 | _x_x_mozilla_cycle_collect,831 07:30:56 INFO - PROCESS | 11406 | __end_cc_report 07:30:56 INFO - PROCESS | 11406 | __startTimestamp1459780256056__endTimestamp 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | ------- Summary: start ------- 07:30:56 INFO - PROCESS | 11406 | Number of tests: 14 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#0] ai-astar Cycles:10 Average:111.60 Median:111.00 stddev:4.79 (4.3%) stddev-sans-first:5.07 07:30:56 INFO - PROCESS | 11406 | Values: 111.0 105.0 112.0 110.0 112.0 124.0 111.0 110.0 110.0 111.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#1] audio-beat-detection Cycles:10 Average:149.20 Median:157.50 stddev:16.88 (10.7%) stddev-sans-first:17.77 07:30:56 INFO - PROCESS | 11406 | Values: 155.0 128.0 157.0 170.0 132.0 160.0 158.0 130.0 170.0 132.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#2] audio-dft Cycles:10 Average:164.00 Median:163.00 stddev:2.98 (1.8%) stddev-sans-first:3.07 07:30:56 INFO - PROCESS | 11406 | Values: 162.0 163.0 163.0 162.0 162.0 163.0 162.0 169.0 170.0 164.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#3] audio-fft Cycles:10 Average:83.60 Median:76.00 stddev:25.13 (33.1%) stddev-sans-first:26.54 07:30:56 INFO - PROCESS | 11406 | Values: 77.0 77.0 76.0 77.0 76.0 73.0 76.0 73.0 155.0 76.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#4] audio-oscillator Cycles:10 Average:107.30 Median:93.00 stddev:23.60 (25.4%) stddev-sans-first:24.38 07:30:56 INFO - PROCESS | 11406 | Values: 92.0 93.0 132.0 93.0 93.0 93.0 149.0 93.0 93.0 142.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#5] imaging-gaussian-blur Cycles:10 Average:117.50 Median:118.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 07:30:56 INFO - PROCESS | 11406 | Values: 118.0 117.0 117.0 118.0 118.0 117.0 117.0 118.0 117.0 118.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#6] imaging-darkroom Cycles:10 Average:146.60 Median:147.00 stddev:0.97 (0.7%) stddev-sans-first:0.83 07:30:56 INFO - PROCESS | 11406 | Values: 145.0 147.0 146.0 146.0 146.0 147.0 148.0 147.0 148.0 146.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#7] imaging-desaturate Cycles:10 Average:96.10 Median:96.00 stddev:0.74 (0.8%) stddev-sans-first:0.78 07:30:56 INFO - PROCESS | 11406 | Values: 96.0 96.0 96.0 98.0 95.0 96.0 96.0 96.0 96.0 96.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#8] json-parse-financial Cycles:10 Average:59.20 Median:59.00 stddev:1.87 (3.2%) stddev-sans-first:1.69 07:30:56 INFO - PROCESS | 11406 | Values: 62.0 58.0 62.0 58.0 61.0 58.0 58.0 60.0 57.0 58.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#9] json-stringify-tinderbox Cycles:10 Average:60.90 Median:61.00 stddev:0.99 (1.6%) stddev-sans-first:1.05 07:30:56 INFO - PROCESS | 11406 | Values: 61.0 63.0 61.0 61.0 61.0 62.0 60.0 60.0 60.0 60.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#10] stanford-crypto-aes Cycles:10 Average:81.50 Median:81.00 stddev:2.80 (3.5%) stddev-sans-first:2.96 07:30:56 INFO - PROCESS | 11406 | Values: 81.0 82.0 81.0 82.0 81.0 80.0 89.0 80.0 80.0 79.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#11] stanford-crypto-ccm Cycles:10 Average:119.00 Median:119.00 stddev:5.19 (4.4%) stddev-sans-first:5.45 07:30:56 INFO - PROCESS | 11406 | Values: 117.0 117.0 115.0 123.0 123.0 115.0 113.0 130.0 116.0 121.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:145.20 Median:147.00 stddev:5.09 (3.5%) stddev-sans-first:3.84 07:30:56 INFO - PROCESS | 11406 | Values: 135.0 147.0 147.0 149.0 144.0 145.0 148.0 145.0 153.0 139.0 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - PROCESS | 11406 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.30 Median:66.00 stddev:2.50 (3.8%) stddev-sans-first:2.60 07:30:56 INFO - PROCESS | 11406 | Values: 65.0 64.0 69.0 71.0 66.0 65.0 64.0 64.0 69.0 66.0 07:30:56 INFO - PROCESS | 11406 | -------- Summary: end -------- 07:30:56 INFO - PROCESS | 11406 | 07:30:56 INFO - TEST-INFO | 11406: exit 0 07:30:56 INFO - TEST-OK | kraken | took 60237ms 07:30:56 INFO - SUITE-END | took 1170s 07:30:57 INFO - Completed test suite (00:19:30) 07:30:57 INFO - javascript benchmark 07:30:57 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3104.6429660589033, 3119.5476655884895, 3136.6863313668623, 3139.12104610709, 3167.3506931079132, 5074.5432911038, 5109.003744269869, 5209.817656382027, 5220.817271395502, 5272.630915835893, 5173.741312934357, 5243.606729495294, 5354.946450535504, 5361.088614935461, 5414.864628384293, 4529.5470452954605, 4735.90528189436, 4828.589569886564, 4891.095147397725, 4906.877328066791, 4818.710877347353, 4830.9033819323595, 4843.878903027435, 4851.054044461332, 4894.5594896459315, 4683.90632187356, 4736.952630473703, 4782.689125206885, 4801.73590452525, 4850.102730994742, 4805.279208118775, 4823.9517604824205, 4829.0, 4833.661643684944, 4860.635452341088, 4777.402824646919, 4799.568038876518, 4810.663253572251, 4814.518548145193, 4821.445533763592, 5059.418166910816, 5229.764660590283, 5244.790208391698, 5277.472252774692, 5282.181261904411, 5583.274174357308, 5596.300462442195, 5598.832035038955, 5603.663780173162, 5638.351589567212, 5618.7190640468225, 5628.71856407178, 5636.830895073154, 5649.23735295734, 5680.261565996394, 5396.865078373033, 5415.296011518478, 5448.37343705471, 5483.204935284361, 5498.120300751861, 5823.155642431823, 5849.64902105875, 5871.119332100219, 5877.794277200277, 5879.559033072536, 5473.370562385297, 5635.0, 5644.491995720405, 5646.0, 5655.773769049274, 5641.464060914206, 5650.0, 5700.458456446631, 5720.256366672306, 5740.770369185269, 5601.075822489325, 5671.120976248688, 5674.205611214434, 5678.886422271531, 5687.630304030225, 5584.441555844383, 5682.460166284196, 5704.657720536781, 5748.396418376094, 5763.0, 4315.611594956469, 4332.4367832181615, 4366.541513141138, 4372.081862808782, 4393.824247030083, 3835.7314987950576, 3870.9806450968126, 3912.550056743454, 3928.980355098206, 3947.111899822517, 5499.862503437366, 5501.202325662756, 5501.367342755554, 5504.614676972574, 5552.305961754781, 5576.442355764391, 5750.539956803445, 5769.423057694281, 5773.076307790733, 5776.306843178845, 5377.892442151135, 5385.919211211835, 5411.161270003156, 5455.318085239345, 5470.53500452466, 4890.731009794425, 4895.069936712013, 4944.332515110486, 4954.3063971044085, 4969.801207951714, 5698.458646428583, 5780.913286300709, 5874.236349274567, 5891.528677705774, 5900.291964964232, 5687.914681279784, 5737.368889422244, 5741.684207368635, 5774.566907481872, 5797.420257974169, 5842.38654941242, 5853.414658534112, 5853.473187412983, 5857.974854400378, 5863.648181109147, 5457.0, 5579.525740312119, 5591.27313449249, 5616.775328986795, 5632.239647647515, 5705.971470142623, 5750.0512415450985, 5760.0, 5797.681127537857, 5798.884022319615, 5627.43725627434, 5645.1532270159805, 5651.915221271766, 5657.745401456862, 5672.262605861377, 5508.44915508446, 5547.306586676666, 5585.273914391103, 5606.074997625346, 5635.830925072254, 5482.17767334903, 5496.725163741717, 5508.366537848199, 5526.889462210814, 5575.944240557705, 5566.721663916707, 5600.523955463668, 5622.662640241599, 5627.943720562742, 5638.915416268841, 5397.7840886365675, 5417.620766546304, 5494.670319780826, 5509.449055094458, 5572.665640061609], "unit": "score", "name": "dojo.html", "value": 5249.073134465703}, {"lowerIsBetter": false, "replicates": [559.7845068872632, 563.2086917880376, 572.7651662818245, 593.4747748242809, 593.5993204586903, 36506.63493365069, 37193.44209836851, 37353.43969840451, 37392.43911341332, 37433.25133497328, 37566.624333756656, 37964.24071518568, 38001.80999095001, 38089.42865857014, 38143.427848582294, 8394.664213431472, 8581.013183483885, 8587.828243435128, 8598.097199794025, 8613.698520551781, 8468.915310846905, 8709.390342676015, 8721.345899057596, 8777.824443511126, 8791.824163516758, 8755.3871229014, 8757.124287571223, 8835.690750823722, 8846.336524760636, 8870.0, 8667.956660216722, 8798.560071996375, 8802.779930501725, 8813.603387847563, 8818.0, 8699.565021748887, 8814.647414103492, 8821.426607270507, 8832.293416526663, 8850.070742572001, 34411.31177376463, 38639.42040869389, 38831.22337553233, 38841.223175536616, 38872.61127388718, 3385.4414021686393, 3548.3258180945795, 3600.4419315005953, 3805.6955443564448, 4422.181896349186, 28610.0, 28681.56977645337, 28955.56566651502, 29148.0, 31465.528017079763, 4219.367094935754, 4259.403683484284, 4292.055747735524, 4379.605835474791, 4412.382266482695, 306479.0, 309893.0, 312237.0, 312462.0, 312530.0, 47032.5296747035, 64210.67894660497, 64822.675886620265, 64985.67507162529, 65231.0, 46219.306710399374, 46629.76685116553, 46989.76505117521, 47177.0, 47243.0, 15820.0, 15863.841361586236, 15877.12675802819, 16036.919815401081, 16053.197340132947, 12549.686257843445, 12637.178583392233, 12665.49338026487, 12678.492860285669, 12696.6825829355, 16181.59546011359, 16188.0, 16210.297918718601, 16217.756733649005, 16284.348626055062, 5863.765449381977, 6045.153678485016, 6170.352113028157, 6263.404976527223, 6304.779332723333, 1077.5743581285349, 1098.81869491533, 1106.1372129738816, 1142.177632104883, 1188.9299630332596, 31546.211344716565, 31708.84145579257, 31829.20426989344, 32359.0, 32454.188645283586, 1115.8158903780948, 1155.6648571914218, 1197.1141355397117, 1236.1285293867802, 1259.3829023778283, 16513.83486165147, 16699.74950375745, 16821.878934431163, 16841.494755157364, 17037.40369087076, 412161.0, 419830.0, 421444.0, 422136.0, 422746.0, 56991.430085699445, 57827.4217257822, 57866.0, 57916.0, 57939.13091303634, 1366.2075995922341, 1374.4433504430722, 1390.1311680199874, 1405.9648508787157, 1430.81399418075, 31305.217369565944, 31499.0, 31565.526517101804, 32276.0, 32399.51400729038, 50823.0, 51144.48855511546, 51194.232086517986, 51358.74320628373, 51631.0, 380551.0, 381802.0, 386156.0, 387098.0, 389493.0, 36610.8169459151, 36932.0, 37295.44056839095, 37467.62532374641, 37541.24917501689, 49111.0, 49324.506754931994, 50282.497175029246, 51090.233646496075, 52085.47914520958, 37114.0, 37318.0, 37773.81113094417, 37808.0, 38241.0, 36807.44788828116, 40521.79739101286, 44484.77757611191, 44890.0, 46972.7651361741, 41865.37201942034, 47401.0, 47407.76296118497, 47865.0, 48668.513314866395, 35645.643543564234, 35848.82075589606, 35865.87330483798, 36076.4588531167, 36295.0, 27987.300317492227, 28617.28456788597, 28702.0, 28742.856285718437, 28986.42027159487], "unit": "score", "name": "ext.html", "value": 19531.963685416154}, {"lowerIsBetter": false, "replicates": [350.42005480929066, 358.27270640599573, 364.7811313212073, 374.18427827336393, 375.42934739196403, 17039.233234504445, 17489.475315740532, 17955.461336159904, 17971.10144492775, 17989.550261243476, 16674.749878751827, 17163.485095447126, 17241.827581724177, 17361.7395739064, 17364.21861016254, 5196.090684130281, 5328.5470734987375, 5473.67157970523, 5476.479734425223, 5496.0931446311315, 5447.319085114361, 5503.257060296869, 5508.6970216638065, 5515.696636684981, 5522.171674248854, 5273.604479664022, 5423.132298832187, 5445.401005889349, 5450.0, 5513.09034009388, 5283.313169288006, 5336.786528538853, 5364.812231571896, 5368.946310536923, 5380.139177731544, 4733.621310295168, 4771.522847715235, 4789.592884604813, 4897.314375987365, 4901.3383193269165, 21140.0, 21367.35897923065, 21711.34865954024, 21755.12979480819, 21865.12539498418, 2387.2838148555365, 2519.44572194117, 2551.9489610207693, 2668.9599656005175, 3075.784695071346, 13794.586162415144, 13894.444222231099, 13920.860791392159, 14118.223497707622, 14206.289685515683, 1843.382466873599, 1856.4616261284345, 1979.5051237190703, 2009.0959068419124, 2046.2531176120608, 65742.67128664374, 65886.67056664734, 66041.339586604, 68176.31823681749, 69243.65378173128, 9930.553125109387, 10097.646582369582, 10224.386536807815, 10387.896121038844, 10480.266381353233, 13965.441382344592, 14019.439222430989, 14024.667656572608, 14100.85899141016, 14107.36516856744, 7286.817829554304, 7518.28576285252, 7650.2349765023055, 7759.72840950564, 8077.8788318175275, 7273.3817625502425, 7557.0, 7703.383729301754, 7779.144294127642, 7934.761957141295, 4498.865034048984, 4499.752513611717, 4502.954970450253, 4581.152486789954, 4598.218302888517, 1707.8036025856936, 1888.9149988250563, 1913.1773337464745, 1934.1586409911733, 1975.4764987278384, 908.8046070094962, 997.6308765756717, 998.1054940672109, 1098.4343063322394, 1152.2740673375888, 17611.647767044844, 17644.294228230727, 18081.186346614435, 18120.546986325448, 18325.7251141233, 1012.8885822559513, 1025.4308858583559, 1056.3292309383596, 1062.0972173652333, 1071.2982996137541, 10192.388456692473, 10252.64115755945, 10305.94847025775, 10325.793484130276, 10454.425006624557, 488890.0, 488917.0, 494996.0, 509077.0, 509134.0, 80029.0, 81983.59008204921, 83653.16346836576, 84052.0, 84062.15937840665, 1033.6692258477365, 1053.1101219469535, 1054.514923135351, 1055.482813421418, 1088.6298658456005, 15696.686066278382, 15799.842001579837, 16122.355105795637, 16225.756613651041, 16606.83393166101, 34281.657183427844, 36978.815105924295, 37436.0, 38571.22857542778, 39728.404073938334, 50623.74688126683, 50872.0, 51061.23408148955, 51171.232431514305, 51631.48368516417, 7677.500962437423, 7886.369090472634, 7889.408294377829, 7967.84064318722, 8016.038075430985, 12526.624201273977, 12645.810312845131, 12658.936705316415, 12800.487980480677, 12819.359032048547, 11054.502547385226, 11546.59586914454, 11714.0, 11748.29510229389, 11880.108991825475, 7169.677364518713, 11210.775784484102, 11295.152863535432, 11305.26515776472, 11320.830187547359, 11373.772524549628, 11633.0, 11826.82259766087, 11846.703832403915, 11928.76142477163, 7863.449558530848, 7869.921300786918, 7939.245771651684, 7966.681332746625, 8052.396070294869, 11046.723831904266, 11567.479463423997, 11641.41792910368, 12150.331731754839, 12177.0], "unit": "score", "name": "jquery.html", "value": 8847.63336519078}, {"lowerIsBetter": false, "replicates": [1497.1167011463237, 1507.4196434372764, 1690.391459074733, 1807.9005654688988, 1818.6271814278075, 7033.50765446419, 7552.131504876941, 7662.6551805168765, 7846.333061689763, 7850.725224617139, 7584.0, 7586.962065189667, 7629.275218854214, 7653.464257501977, 7680.423968202394, 2214.092222188907, 2286.27982185611, 2294.8737819419925, 2302.9884850575722, 2317.212147869724, 2312.895919683618, 2331.079223706635, 2356.6229403295474, 2363.0547780887696, 2364.4916342986253, 2269.3986093685185, 2274.65880117982, 2306.319635707462, 2311.7572654871246, 2327.150590034642, 2201.559688062394, 2319.761430219846, 2369.0168580039262, 2383.7020372453444, 2384.3681424422543, 2363.5981883079917, 2366.4675448024227, 2375.7267914189915, 2386.809055275574, 2394.844335118229, 7908.485948413335, 7916.575016497029, 7953.323967462715, 7956.28393444587, 7965.96017019917, 4958.752062396866, 5080.669756465818, 5103.055934652064, 5114.232865070232, 5114.514121158484, 3235.8705651773903, 3332.2002719347424, 3391.6438773928876, 3409.5226668266464, 3422.760406771527, 1187.6912002879228, 1220.1032241302635, 1220.1093201962617, 1230.5077968812457, 1246.464020471197, 10629.362238265652, 10811.459427028618, 10843.566257349696, 10865.565377384895, 10897.83653245194, 4368.0, 4408.382826404306, 4416.116776644684, 4440.62254708347, 4534.387857639243, 9290.1174388433, 9341.065893410605, 9343.672971446103, 9363.765905852271, 9399.24806015517, 5048.798048078036, 5074.619403544749, 5077.111505486525, 5085.262636917626, 5102.897942041139, 4126.360414135814, 4447.644188464915, 4584.587387135174, 4627.606653434428, 4667.556582124693, 3707.1658876752513, 3731.2910546995986, 3765.4163604641326, 3793.430985352219, 3797.1266608680157, 1192.1237890150733, 1198.7063169523349, 1251.0679543739973, 1251.418090587881, 1264.6016504800957, 1391.3530208452914, 1414.4625042483997, 1417.9351504641588, 1428.6428392901776, 1438.6115748747989, 7324.853502929912, 7346.63266836656, 7389.482736208522, 7390.334869861738, 7407.740729074457, 486.2584558548242, 503.1948881789181, 506.42014892947367, 509.35057801302895, 512.1140427061131, 5861.17943487912, 5876.471117599351, 5919.467247947706, 5929.851753706192, 5930.851728706817, 9003.234725048444, 9533.570989305497, 9601.759956001017, 9673.903260967441, 9676.806463870824, 9411.152996230372, 9459.858102128474, 9551.856722149174, 9554.90445095554, 9589.089036541518, 7118.679659415338, 7458.0, 7463.9626801866725, 7475.327220550285, 7528.548287102792, 7201.063861697946, 7252.5648461092505, 7348.96325518369, 7350.0, 7360.631968401665, 8377.916220837957, 8478.448900821428, 8489.40574159803, 8550.1449855014, 8668.219860212612, 8590.785230369042, 8722.171393717586, 8776.517291549026, 8817.294616430541, 8826.691065812665, 6239.0953311768635, 6517.055027020961, 6682.63245521501, 7030.964845175741, 7133.6076515790055, 7302.817429564091, 7391.963040184764, 7394.482386233127, 7438.40492760567, 7452.105747310357, 6724.8991265132045, 6783.660816959034, 6864.0, 6923.653817309215, 7007.964960175166, 6534.542582019213, 6597.6701164940605, 6635.568688035262, 6640.369164929324, 6783.18601767791, 6885.552439091443, 6891.241963383924, 6968.79093627192, 6973.16322041338, 6973.860522789617, 6574.3754343337305, 6686.53194276396, 6692.866142677217, 6710.362515561014, 6734.595924244561, 6622.8344291393105, 6731.629760363227, 6752.257251702211, 6757.628330441873, 6759.86480270382], "unit": "score", "name": "mootools.html", "value": 4528.363599599908}, {"lowerIsBetter": false, "replicates": [344.1877169879085, 346.22618447769247, 347.15987310708084, 351.40787772603164, 354.71977138060925, 6338.714757835897, 6357.1417858589075, 6381.5851969621945, 6452.7096280667365, 6456.225252969644, 6291.496680265579, 6298.149749783778, 6300.905486417708, 6305.779297724581, 6306.463950564207, 4578.084383123372, 4664.790084446208, 4700.0, 4709.576138147566, 4777.52224777522, 4680.882977925545, 4685.1332503486965, 4699.812007519695, 4702.3416721659, 4715.1512727709, 4641.512641172679, 4643.512431194727, 4667.813287468497, 4684.156851766681, 4709.976450117744, 4715.552022557851, 4724.811007559693, 4725.267583524559, 4729.9054018919605, 4733.644976626767, 4107.815148318333, 4109.938350924738, 4111.0, 4114.156597897424, 4115.42384066231, 6131.724072416708, 6137.202163718733, 6142.170806941095, 6164.7534098636, 6165.260168779775, 5387.1111266640955, 5582.246396736429, 5589.860253493654, 5590.413006634326, 5591.2731344925305, 6694.59832410057, 6711.9664401678165, 6725.865482690368, 6730.495212859007, 6739.730410783563, 4559.521250268707, 4593.931091033637, 4597.954020459786, 4602.746848923308, 4605.078984203139, 7014.964925175393, 7066.152061752623, 7067.964660176717, 7071.964640176766, 7092.893606595905, 4525.117602067565, 4687.968646897677, 4703.176944034849, 4705.388299521041, 4715.7877895494785, 4736.715797052188, 4753.04939012199, 4756.048790241965, 4763.499832517605, 4779.761011949388, 5525.778968841281, 5546.722663866791, 5567.526760225345, 5572.554195664337, 5576.275084239023, 6826.556273842284, 6827.658617069127, 6827.658617069226, 6834.2482326944, 6839.008343790122, 1641.9917900410421, 1680.579855036241, 1681.2434404518017, 1683.099541745185, 1683.4276346042404, 1050.653284416156, 1092.4264761000538, 1093.8359246112987, 1102.5865300512307, 1102.72431892027, 6558.737650494022, 6568.704408301638, 6578.769743059066, 6592.604443733391, 6592.8351791205605, 6978.092847929736, 7023.262557431396, 7043.788686339418, 7050.435965122778, 7067.116610423697, 6302.590331628429, 6414.1340918976275, 6516.934830651633, 6575.046618240328, 6643.60138391698, 3795.791231482295, 3831.7126215533945, 3832.9041773955873, 3834.750741201813, 3841.385378339508, 7235.710571577183, 7279.854402911912, 7290.854182916418, 7295.52579082358, 7301.926980730231, 7193.280671932765, 7197.964010179916, 7215.567065976058, 7242.9275707243305, 7248.855022899513, 7094.893576596355, 7301.37938275242, 7308.926910730931, 7308.96345518269, 7311.159216690149, 7048.400885924754, 7060.929390706027, 7065.434765218667, 7088.893666595109, 7094.893576596459, 6916.066331045245, 6997.545159564612, 7001.194862590663, 7017.578945263301, 7030.4024157945105, 7289.927100728924, 7302.525335853153, 7305.196428392766, 7307.086614173229, 7310.159331676712, 4520.163769702615, 4680.859574212779, 4695.0375173090115, 4699.389079419653, 4705.717656940595, 6929.237783843874, 6941.722331106699, 6973.79078627642, 6984.965075174591, 7000.124984376953, 6724.226713927766, 6754.358335958076, 6764.425023873026, 6788.898166527605, 6797.864042719217, 6678.799636010927, 6688.899666504909, 6703.128593282842, 6703.731850725916, 6718.428933540704, 6483.513736469689, 6617.2721000688925, 6623.768168114093, 6628.27089020217, 6646.767363142267, 6731.596104233761, 6779.796606101825, 6816.795496135124, 6820.113385259884, 6823.0, 6545.836354090995, 6600.504962127764, 6613.834654133685, 6620.271770105188, 6630.668466576748], "unit": "score", "name": "prototype.html", "value": 5058.986695655255}, {"lowerIsBetter": false, "replicates": [745.2956955676881, 791.4499422901082, 835.9874601880973, 839.4459656626626, 860.969866054688, 12991.545295914644, 13099.0, 13123.409446574904, 13205.207687538754, 13243.006774491903, 13055.281959492224, 13253.668658283523, 13254.337283135828, 13258.535951241709, 13271.137376070548, 714.546263122918, 811.9188081191863, 859.256742917375, 861.6424183963647, 864.9610767515445, 854.3763052971335, 855.1918437076964, 857.2841677199546, 857.8412993596205, 860.5697151424288, 882.6469412235093, 885.8538341173698, 889.4663202078733, 893.4371346052011, 897.7755561109723, 883.9381243312971, 885.3050355470924, 889.204162274767, 891.3983061433539, 892.433304851424, 651.6188030002454, 651.7523341130387, 654.2410803467955, 654.2966311215463, 656.727458104886, 12882.291473968928, 12899.226046437243, 12918.22490650564, 13214.471421143238, 13256.20462772227, 14248.0, 14283.0, 14406.351714172888, 14477.493287734878, 14543.127412355292, 11438.084953203725, 11462.0, 11479.25384849982, 11522.193446458752, 11522.942385288105, 4486.226628022035, 4554.407926969473, 4579.542045795394, 4584.7478388688605, 4705.505921878222, 52065.73967130178, 52500.474995249555, 52884.47115528834, 52892.73553632207, 53263.73368133173, 10071.798564028679, 10348.896511034944, 10384.117350025332, 10475.319104258198, 10482.63310784119, 18162.45512634623, 18204.63590728178, 18230.45308640743, 18244.63510729778, 18271.36050238235, 7949.960250198712, 8060.0, 8073.555954422563, 8173.95913020443, 8196.467229630054, 4626.329182268552, 4686.835960741358, 4739.312799644102, 4797.880052998703, 4809.062232864558, 3384.390809654237, 3408.9602671185526, 3431.742619303562, 3433.1073920780777, 3434.4676575130893, 604.2507290959179, 613.6195558753601, 619.3651507205151, 623.3517142172091, 630.168178005029, 646.2568046746186, 648.8280605639509, 665.1851481934688, 666.3136968922018, 707.3739740329743, 9212.170904618617, 9245.676401325922, 9312.767180820398, 9375.0, 9533.570989305497, 585.5227989188883, 647.9956068094529, 687.2646268492765, 692.5221597097986, 702.68379229347, 4066.532348779869, 4146.543880173179, 4224.619784219435, 4278.016056307005, 4366.017646029618, 64397.0, 64972.0, 65254.0, 65735.67132164404, 67131.32868671349, 54136.0, 54675.72662136664, 54898.45101549013, 55078.72460637752, 55134.448655513734, 53978.46021539813, 54398.45601544013, 54567.0, 54576.72711636496, 55310.0, 8078.757637270891, 8110.432269741062, 8251.133630968661, 8345.290650294794, 8446.873296900674, 39122.0, 39871.2025759489, 40469.797651011555, 40580.3912941312, 40800.0, 51739.48260517497, 53022.0, 53119.20321195263, 53350.199747004604, 53996.46003539914, 10396.844047339144, 10514.369137851447, 10586.89413105859, 10678.412687301961, 10726.517306721373, 10803.945980270048, 11131.554737810397, 11184.720381990515, 11286.717832054264, 11367.20429569922, 11074.5570177192, 11116.11071114325, 11218.55125794959, 11235.438228088726, 11792.056635469313, 10434.21743369235, 10590.523426445674, 10645.946770266099, 10766.623168189075, 10988.780224395627, 10719.828339030353, 10889.346639201673, 10926.180536459957, 10930.890691092987, 11283.492242849255, 8710.346723995599, 8713.346499012727, 8829.69096081634, 8900.287976961697, 8974.641014359353, 9089.909100908906, 9102.635894564144, 9171.082891710776, 9259.67591134307, 9416.964133945397], "unit": "score", "name": "yui.html", "value": 6596.779374230907}], "name": "dromaeo_css", "value": 7180.784031834446}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 105.0, 112.0, 110.0, 112.0, 124.0, 111.0, 110.0, 110.0, 111.0], "unit": "score", "name": "ai-astar", "value": 111.6}, {"lowerIsBetter": true, "replicates": [155.0, 128.0, 157.0, 170.0, 132.0, 160.0, 158.0, 130.0, 170.0, 132.0], "unit": "score", "name": "audio-beat-detection", "value": 149.2}, {"lowerIsBetter": true, "replicates": [162.0, 163.0, 163.0, 162.0, 162.0, 163.0, 162.0, 169.0, 170.0, 164.0], "unit": "score", "name": "audio-dft", "value": 164.0}, {"lowerIsBetter": true, "replicates": [77.0, 77.0, 76.0, 77.0, 76.0, 73.0, 76.0, 73.0, 155.0, 76.0], "unit": "score", "name": "audio-fft", "value": 83.6}, {"lowerIsBetter": true, "replicates": [92.0, 93.0, 132.0, 93.0, 93.0, 93.0, 149.0, 93.0, 93.0, 142.0], "unit": "score", "name": "audio-oscillator", "value": 107.3}, {"lowerIsBetter": true, "replicates": [118.0, 117.0, 117.0, 118.0, 118.0, 117.0, 117.0, 118.0, 117.0, 118.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.5}, {"lowerIsBetter": true, "replicates": [145.0, 147.0, 146.0, 146.0, 146.0, 147.0, 148.0, 147.0, 148.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 146.6}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 96.0, 98.0, 95.0, 96.0, 96.0, 96.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.1}, {"lowerIsBetter": true, "replicates": [62.0, 58.0, 62.0, 58.0, 61.0, 58.0, 58.0, 60.0, 57.0, 58.0], "unit": "score", "name": "json-parse-financial", "value": 59.2}, {"lowerIsBetter": true, "replicates": [61.0, 63.0, 61.0, 61.0, 61.0, 62.0, 60.0, 60.0, 60.0, 60.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 60.9}, {"lowerIsBetter": true, "replicates": [81.0, 82.0, 81.0, 82.0, 81.0, 80.0, 89.0, 80.0, 80.0, 79.0], "unit": "score", "name": "stanford-crypto-aes", "value": 81.5}, {"lowerIsBetter": true, "replicates": [117.0, 117.0, 115.0, 123.0, 123.0, 115.0, 113.0, 130.0, 116.0, 121.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 119.0}, {"lowerIsBetter": true, "replicates": [135.0, 147.0, 147.0, 149.0, 144.0, 145.0, 148.0, 145.0, 153.0, 139.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 145.2}, {"lowerIsBetter": true, "replicates": [65.0, 64.0, 69.0, 71.0, 66.0, 65.0, 64.0, 64.0, 69.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.3}], "name": "kraken", "value": 1508.0}]} 07:30:57 INFO - Return code: 0 07:30:57 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 07:30:57 ERROR - # TBPL SUCCESS # 07:30:57 INFO - Running post-action listener: _resource_record_post_action 07:30:57 INFO - Running post-run listener: _resource_record_post_run 07:30:58 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 0; Write bytes: 538705920; Read time: 0; Write time: 494860 07:30:58 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 243249152; Read time: 0; Write time: 307704 07:30:58 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 0; Write bytes: 295456768; Read time: 0; Write time: 187156 07:30:58 INFO - Running post-run listener: _upload_blobber_files 07:30:58 INFO - Blob upload gear active. 07:30:58 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 07:30:58 INFO - Files from /builds/slave/test-pgo/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 07:30:58 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 07:30:58 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Firefox -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 07:30:58 INFO - (blobuploader) - INFO - Open directory for files ... 07:30:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 07:30:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:30:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:30:59 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 07:30:59 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:30:59 INFO - (blobuploader) - INFO - Done attempting. 07:30:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 07:30:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:30:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:31:00 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 07:31:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:31:00 INFO - (blobuploader) - INFO - Done attempting. 07:31:00 INFO - (blobuploader) - INFO - Iteration through files over. 07:31:00 INFO - Return code: 0 07:31:00 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 07:31:00 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 07:31:00 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/61b3f93f76a08a02440ecb2259ffb7c7068ab32e37bfa8a1f4c49b7a4ca0dfe6673a90a7ddb1b9e89e640f831d618284d833c429820fede1145dda11f11ff8d0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/450da1ddafc0e47a90d1ffe426f0689e02ed5c5504051be98c8be519374f67bbd0be4f4f9d36788ff9448847d46cb214d70cad4d6a4664306af35ee9559434af"} 07:31:00 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 07:31:00 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 07:31:00 INFO - Contents: 07:31:00 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/61b3f93f76a08a02440ecb2259ffb7c7068ab32e37bfa8a1f4c49b7a4ca0dfe6673a90a7ddb1b9e89e640f831d618284d833c429820fede1145dda11f11ff8d0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/450da1ddafc0e47a90d1ffe426f0689e02ed5c5504051be98c8be519374f67bbd0be4f4f9d36788ff9448847d46cb214d70cad4d6a4664306af35ee9559434af"} 07:31:00 INFO - Running post-run listener: copy_logs_to_upload_dir 07:31:00 INFO - Copying logs to upload dir... 07:31:00 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 07:31:00 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1246.077541 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 46 secs) (at 2016-04-04 07:30:59.305154) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-04 07:30:59.309008) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test-pgo/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-pgo/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=7de08804244eb36560b44971000001c3-1459778890.312023-1948284489 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/Firefox/sha512/61b3f93f76a08a02440ecb2259ffb7c7068ab32e37bfa8a1f4c49b7a4ca0dfe6673a90a7ddb1b9e89e640f831d618284d833c429820fede1145dda11f11ff8d0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/450da1ddafc0e47a90d1ffe426f0689e02ed5c5504051be98c8be519374f67bbd0be4f4f9d36788ff9448847d46cb214d70cad4d6a4664306af35ee9559434af"} build_url:https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011541 build_url: 'https://queue.taskcluster.net/v1/task/VGUi7LJTTrmDG_AaUA60wQ/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/61b3f93f76a08a02440ecb2259ffb7c7068ab32e37bfa8a1f4c49b7a4ca0dfe6673a90a7ddb1b9e89e640f831d618284d833c429820fede1145dda11f11ff8d0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/450da1ddafc0e47a90d1ffe426f0689e02ed5c5504051be98c8be519374f67bbd0be4f4f9d36788ff9448847d46cb214d70cad4d6a4664306af35ee9559434af"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-04 07:30:59.334184) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-04 07:30:59.334486) ========= rm -f oauth.txt in dir /builds/slave/test-pgo/. (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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=7de08804244eb36560b44971000001c3-1459778890.312023-1948284489 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004441 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-04 07:30:59.417586) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-04 07:30:59.417955) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-04 07:30:59.418243) ========= ========= Total master_lag: 0.28 =========