builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-028 starttime: 1456823074.71 results: success (0) buildid: 20160229223041 builduid: a23eeb87f1474801a3b0e9dc0dde66a3 revision: 74a8cd912dcd154cdfd0c771d7d4ea73f016191e ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:34.710926) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:34.711427) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:34.711757) ========= 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=836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.005946 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.05 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:34.766132) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:34.766486) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:34.803324) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:34.803625) ========= 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=836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.008739 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:34.853075) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:34.853396) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:34.853810) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:34.854133) ========= 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=836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-01 01:04:34-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 35.1M=0s 2016-03-01 01:04:35 (35.1 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.193913 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:35.060186) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:35.060527) ========= 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=836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.099796 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:35.172838) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-01 01:04:35.173464) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 74a8cd912dcd154cdfd0c771d7d4ea73f016191e --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 74a8cd912dcd154cdfd0c771d7d4ea73f016191e --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=836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-01 01:04:35,280 truncating revision to first 12 chars 2016-03-01 01:04:35,280 Setting DEBUG logging. 2016-03-01 01:04:35,280 attempt 1/10 2016-03-01 01:04:35,280 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/74a8cd912dcd?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-01 01:04:36,466 unpacking tar archive at: mozilla-inbound-74a8cd912dcd/testing/mozharness/ program finished with exit code 0 elapsedTime=1.503956 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-01 01:04:36.691025) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:36.691451) ========= echo 74a8cd912dcd154cdfd0c771d7d4ea73f016191e in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'74a8cd912dcd154cdfd0c771d7d4ea73f016191e'] 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=836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 74a8cd912dcd154cdfd0c771d7d4ea73f016191e program finished with exit code 0 elapsedTime=0.004593 script_repo_revision: '74a8cd912dcd154cdfd0c771d7d4ea73f016191e' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:36.743441) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:36.743802) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-01 01:04:36.753755) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-03-01 01:04:36.754091) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 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', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] 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=836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 01:04:37 INFO - MultiFileLogger online at 20160301 01:04:37 in /builds/slave/test-pgo 01:04:37 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 01:04:37 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 01:04:37 INFO - {'append_to_log': False, 01:04:37 INFO - 'base_work_dir': '/builds/slave/test-pgo', 01:04:37 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 01:04:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 01:04:37 INFO - 'branch': 'Mozilla-Inbound', 01:04:37 INFO - 'buildbot_json_path': 'buildprops.json', 01:04:37 INFO - 'config_files': ('talos/linux_config.py',), 01:04:37 INFO - 'default_actions': ('clobber', 01:04:37 INFO - 'read-buildbot-config', 01:04:37 INFO - 'download-and-extract', 01:04:37 INFO - 'populate-webroot', 01:04:37 INFO - 'create-virtualenv', 01:04:37 INFO - 'install', 01:04:37 INFO - 'run-tests'), 01:04:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 01:04:37 INFO - 'download_minidump_stackwalk': True, 01:04:37 INFO - 'download_symbols': 'ondemand', 01:04:37 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 01:04:37 INFO - 'tooltool.py': '/tools/tooltool.py', 01:04:37 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 01:04:37 INFO - '/tools/misc-python/virtualenv.py')}, 01:04:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 01:04:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 01:04:37 INFO - 'installer_path': 'installer.exe', 01:04:37 INFO - 'log_level': 'info', 01:04:37 INFO - 'log_name': 'talos', 01:04:37 INFO - 'log_to_console': True, 01:04:37 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 01:04:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 01:04:37 INFO - 'opt_config_files': (), 01:04:37 INFO - 'pip_index': False, 01:04:37 INFO - 'sps_profile': False, 01:04:37 INFO - 'sps_profile_interval': 0, 01:04:37 INFO - 'suite': 'dromaeojs', 01:04:37 INFO - 'system_bits': '32', 01:04:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 01:04:37 INFO - 'title': 'talos-linux64-ix-028', 01:04:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 01:04:37 INFO - 'use_talos_json': True, 01:04:37 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 01:04:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 01:04:37 INFO - 'work_dir': 'build'} 01:04:37 INFO - ##### 01:04:37 INFO - ##### Running clobber step. 01:04:37 INFO - ##### 01:04:37 INFO - Running pre-action listener: _resource_record_pre_action 01:04:37 INFO - Running main action method: clobber 01:04:37 INFO - rmtree: /builds/slave/test-pgo/build 01:04:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 01:04:41 INFO - Running post-action listener: _resource_record_post_action 01:04:41 INFO - ##### 01:04:41 INFO - ##### Running read-buildbot-config step. 01:04:41 INFO - ##### 01:04:41 INFO - Running pre-action listener: _resource_record_pre_action 01:04:41 INFO - Running main action method: read_buildbot_config 01:04:41 INFO - Using buildbot properties: 01:04:41 INFO - { 01:04:41 INFO - "project": "", 01:04:41 INFO - "product": "firefox", 01:04:41 INFO - "script_repo_revision": "production", 01:04:41 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs", 01:04:41 INFO - "repository": "", 01:04:41 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs", 01:04:41 INFO - "buildid": "20160229223041", 01:04:41 INFO - "pgo_build": "True", 01:04:41 INFO - "basedir": "/builds/slave/test-pgo", 01:04:41 INFO - "buildnumber": 727, 01:04:41 INFO - "slavename": "talos-linux64-ix-028", 01:04:41 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 01:04:41 INFO - "platform": "ubuntu64_hw", 01:04:41 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos", 01:04:41 INFO - "branch": "mozilla-inbound", 01:04:41 INFO - "repo_path": "integration/mozilla-inbound", 01:04:41 INFO - "revision": "74a8cd912dcd154cdfd0c771d7d4ea73f016191e", 01:04:41 INFO - "stage_platform": "linux64-pgo", 01:04:41 INFO - "builduid": "a23eeb87f1474801a3b0e9dc0dde66a3", 01:04:41 INFO - "slavebuilddir": "test" 01:04:41 INFO - } 01:04:41 INFO - Found installer url https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 01:04:41 INFO - Running post-action listener: _resource_record_post_action 01:04:41 INFO - ##### 01:04:41 INFO - ##### Running download-and-extract step. 01:04:41 INFO - ##### 01:04:41 INFO - Running pre-action listener: _resource_record_pre_action 01:04:41 INFO - Running main action method: download_and_extract 01:04:41 INFO - mkdir: /builds/slave/test-pgo/build/tests 01:04: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')]} 01:04:41 INFO - https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 01:04:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 01:04:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 01:04:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 01:04:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 01:04:42 INFO - Downloaded 1448 bytes. 01:04:42 INFO - Reading from file /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 01:04:42 INFO - Using the following test package requirements: 01:04:42 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 01:04:42 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:04:42 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 01:04:42 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:04:42 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 01:04:42 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:04:42 INFO - u'jsshell-linux-x86_64.zip'], 01:04:42 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:04:42 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 01:04:42 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 01:04:42 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:04:42 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 01:04:42 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:04:42 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 01:04:42 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:04:42 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 01:04:42 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 01:04:42 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 01:04:42 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 01:04:42 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 01:04:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:04:42 INFO - https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 01:04:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 01:04:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 01:04:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 01:04:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 01:04:43 INFO - Downloaded 23384036 bytes. 01:04:43 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 01:04:43 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 01:04:45 INFO - Return code: 0 01:04:45 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 01:04:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:04:45 INFO - https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 01:04:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 01:04:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 01:04:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 01:04:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 01:04:47 INFO - Downloaded 23384036 bytes. 01:04:47 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 01:04:47 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 01:04:48 INFO - Return code: 0 01:04:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:04:48 INFO - https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 01:04:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 01:04:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 01:04:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 01:04:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 01:04:49 INFO - Downloaded 10713413 bytes. 01:04:49 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 01:04:49 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 01:04:50 INFO - Return code: 0 01:04: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')]} 01:04:50 INFO - https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 01:04:50 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 01:04:50 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 01:04:50 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 01:04:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 01:04:52 INFO - Downloaded 56640984 bytes. 01:04:52 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 01:04:52 INFO - mkdir: /builds/slave/test-pgo/properties 01:04:52 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 01:04:52 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 01:04:52 INFO - Contents: 01:04:52 INFO - build_url:https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 01:04:53 INFO - Running post-action listener: _resource_record_post_action 01:04:53 INFO - Running post-action listener: set_extra_try_arguments 01:04:53 INFO - ##### 01:04:53 INFO - ##### Running populate-webroot step. 01:04:53 INFO - ##### 01:04:53 INFO - Running pre-action listener: _resource_record_pre_action 01:04:53 INFO - Running main action method: populate_webroot 01:04:53 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 01:04:53 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 01:04:53 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 01:04:53 INFO - '--tppagecycles', 01:04:53 INFO - '7'], 01:04:53 INFO - 'tests': ['tsvgm']}}, 01:04:53 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 01:04:53 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 01:04:53 INFO - 'tests': ['tresize', 'tcanvasmark']}, 01:04:53 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 01:04:53 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 01:04:53 INFO - 'tests': ['dromaeo_css', 'kraken']}, 01:04:53 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:04:53 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:04:53 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:04:53 INFO - 'talos_options': ['--e10s'], 01:04:53 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:04:53 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:04:53 INFO - 'tests': ['damp', 'tps']}, 01:04:53 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:04:53 INFO - 'talos_options': ['--e10s'], 01:04:53 INFO - 'tests': ['damp', 'tps']}, 01:04:53 INFO - 'g3': {'tests': ['dromaeo_dom']}, 01:04:53 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 01:04:53 INFO - 'other': {'tests': ['a11yr', 01:04:53 INFO - 'ts_paint', 01:04:53 INFO - 'tpaint', 01:04:53 INFO - 'sessionrestore', 01:04:53 INFO - 'sessionrestore_no_auto_restore']}, 01:04:53 INFO - 'other-e10s': {'talos_options': ['--e10s'], 01:04:53 INFO - 'tests': ['a11yr', 01:04:53 INFO - 'ts_paint', 01:04:53 INFO - 'tpaint', 01:04:53 INFO - 'sessionrestore', 01:04:53 INFO - 'sessionrestore_no_auto_restore']}, 01:04:53 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 01:04:53 INFO - 'tests': ['a11yr', 01:04:53 INFO - 'ts_paint', 01:04:53 INFO - 'tpaint', 01:04:53 INFO - 'sessionrestore', 01:04:53 INFO - 'sessionrestore_no_auto_restore']}, 01:04:53 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 01:04:53 INFO - 'tests': ['a11yr', 01:04:53 INFO - 'ts_paint', 01:04:53 INFO - 'tpaint', 01:04:53 INFO - 'sessionrestore', 01:04:53 INFO - 'sessionrestore_no_auto_restore']}, 01:04:53 INFO - 'other_l64': {'tests': ['a11yr', 01:04:53 INFO - 'ts_paint', 01:04:53 INFO - 'tpaint', 01:04:53 INFO - 'sessionrestore', 01:04:53 INFO - 'sessionrestore_no_auto_restore']}, 01:04:53 INFO - 'other_nol64': {'tests': ['a11yr', 01:04:53 INFO - 'ts_paint', 01:04:53 INFO - 'tpaint', 01:04:53 INFO - 'sessionrestore', 01:04:53 INFO - 'sessionrestore_no_auto_restore']}, 01:04:53 INFO - 'svgr': {'tests': ['tsvgx', 01:04:53 INFO - 'tsvgr_opacity', 01:04:53 INFO - 'tart', 01:04:53 INFO - 'tscrollx', 01:04:53 INFO - 'cart']}, 01:04:53 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 01:04:53 INFO - 'tests': ['tsvgx', 01:04:53 INFO - 'tsvgr_opacity', 01:04:53 INFO - 'tart', 01:04:53 INFO - 'tscrollx', 01:04:53 INFO - 'cart']}, 01:04:53 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:04:53 INFO - 'tests': ['tp5o']}, 01:04:53 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:04:53 INFO - 'talos_options': ['--e10s'], 01:04:53 INFO - 'tests': ['tp5o']}, 01:04:53 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:04:53 INFO - 'talos_options': ['--xperf_path', 01:04:53 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:04:53 INFO - 'tests': ['tp5n']}, 01:04:53 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:04:53 INFO - 'talos_options': ['--e10s', 01:04:53 INFO - '--xperf_path', 01:04:53 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:04:53 INFO - 'tests': ['tp5n']}}, 01:04:53 INFO - 'talos.zip': {'path': '', 01:04:53 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 01:04:53 INFO - Running post-action listener: _resource_record_post_action 01:04:53 INFO - ##### 01:04:53 INFO - ##### Running create-virtualenv step. 01:04:53 INFO - ##### 01:04:53 INFO - Running pre-action listener: _resource_record_pre_action 01:04:53 INFO - Running main action method: create_virtualenv 01:04:53 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 01:04:53 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 01:04:53 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 01:04:53 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 01:04:53 INFO - Using real prefix '/usr' 01:04:53 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 01:04:53 INFO - Installing distribute.............................................................................................................................................................................................done. 01:04:55 INFO - Installing pip.................done. 01:04:55 INFO - Return code: 0 01:04:55 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 01:04:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:04:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:04:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:04:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:04:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:04:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:04:55 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 0x7f139d1f4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28748a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2941670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d08c0>, '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 0x29d17c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d1c50>, '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': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', '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 01:04:55 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 01:04:55 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 01:04:55 INFO - Using env: {'DISPLAY': ':0', 01:04:55 INFO - 'HOME': '/home/cltbld', 01:04:55 INFO - 'LANG': 'en_US.UTF-8', 01:04:55 INFO - 'LANGUAGE': 'en_US:en', 01:04:55 INFO - 'LOGNAME': 'cltbld', 01:04:55 INFO - 'MAIL': '/var/mail/cltbld', 01:04:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:04:55 INFO - 'MOZ_NO_REMOTE': '1', 01:04:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:04:55 INFO - 'NO_EM_RESTART': '1', 01:04:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:04:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:04:55 INFO - 'PWD': '/builds/slave/test-pgo', 01:04:55 INFO - 'SHELL': '/bin/bash', 01:04:55 INFO - 'SHLVL': '1', 01:04:55 INFO - 'TERM': 'linux', 01:04:55 INFO - 'TMOUT': '86400', 01:04:55 INFO - 'USER': 'cltbld', 01:04:55 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', 01:04:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:04:55 INFO - '_': '/tools/buildbot/bin/python'} 01:04:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:04:56 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 01:04:56 INFO - Cleaning up... 01:04:56 INFO - Return code: 0 01:04:56 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 01:04: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')]} 01:04:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:04:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:04: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')]} 01:04:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:04:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:04:56 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 0x7f139d1f4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28748a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2941670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d08c0>, '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 0x29d17c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d1c50>, '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': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', '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 01:04:56 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 01:04:56 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 01:04:56 INFO - Using env: {'DISPLAY': ':0', 01:04:56 INFO - 'HOME': '/home/cltbld', 01:04:56 INFO - 'LANG': 'en_US.UTF-8', 01:04:56 INFO - 'LANGUAGE': 'en_US:en', 01:04:56 INFO - 'LOGNAME': 'cltbld', 01:04:56 INFO - 'MAIL': '/var/mail/cltbld', 01:04:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:04:56 INFO - 'MOZ_NO_REMOTE': '1', 01:04:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:04:56 INFO - 'NO_EM_RESTART': '1', 01:04:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:04:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:04:56 INFO - 'PWD': '/builds/slave/test-pgo', 01:04:56 INFO - 'SHELL': '/bin/bash', 01:04:56 INFO - 'SHLVL': '1', 01:04:56 INFO - 'TERM': 'linux', 01:04:56 INFO - 'TMOUT': '86400', 01:04:56 INFO - 'USER': 'cltbld', 01:04:56 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', 01:04:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:04:56 INFO - '_': '/tools/buildbot/bin/python'} 01:04:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:04:56 INFO - Downloading/unpacking psutil>=0.7.1 01:04:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:04:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:04:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:04:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:04:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:04:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:04:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 01:04:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:04:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:04:58 INFO - Installing collected packages: psutil 01:04:58 INFO - Running setup.py install for psutil 01:04:58 INFO - building 'psutil._psutil_linux' extension 01:04:58 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 01:04:59 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 01:04:59 INFO - building 'psutil._psutil_posix' extension 01:04:59 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 01:04:59 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 01:05:00 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:05:00 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:05:00 INFO - Successfully installed psutil 01:05:00 INFO - Cleaning up... 01:05:00 INFO - Return code: 0 01:05:00 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 01:05:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:05:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:05:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:05:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:05:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:00 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 0x7f139d1f4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28748a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2941670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d08c0>, '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 0x29d17c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d1c50>, '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': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', '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 01:05:00 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 01:05:00 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 01:05:00 INFO - Using env: {'DISPLAY': ':0', 01:05:00 INFO - 'HOME': '/home/cltbld', 01:05:00 INFO - 'LANG': 'en_US.UTF-8', 01:05:00 INFO - 'LANGUAGE': 'en_US:en', 01:05:00 INFO - 'LOGNAME': 'cltbld', 01:05:00 INFO - 'MAIL': '/var/mail/cltbld', 01:05:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:05:00 INFO - 'MOZ_NO_REMOTE': '1', 01:05:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:05:00 INFO - 'NO_EM_RESTART': '1', 01:05:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:05:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:05:00 INFO - 'PWD': '/builds/slave/test-pgo', 01:05:00 INFO - 'SHELL': '/bin/bash', 01:05:00 INFO - 'SHLVL': '1', 01:05:00 INFO - 'TERM': 'linux', 01:05:00 INFO - 'TMOUT': '86400', 01:05:00 INFO - 'USER': 'cltbld', 01:05:00 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', 01:05:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:05:00 INFO - '_': '/tools/buildbot/bin/python'} 01:05:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:05:00 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 01:05: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 01:05: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 01:05: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 01:05: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 01:05: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 01:05: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 01:05:02 INFO - Downloading mozsystemmonitor-0.0.tar.gz 01:05:02 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 01:05:02 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 01:05:02 INFO - Installing collected packages: mozsystemmonitor 01:05:02 INFO - Running setup.py install for mozsystemmonitor 01:05:02 INFO - Successfully installed mozsystemmonitor 01:05:02 INFO - Cleaning up... 01:05:02 INFO - Return code: 0 01:05:02 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 01:05:02 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')]} 01:05:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:05:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:02 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')]} 01:05:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:05:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:02 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 0x7f139d1f4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28748a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2941670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d08c0>, '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 0x29d17c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d1c50>, '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': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', '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 01:05:02 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 01:05:02 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 01:05:02 INFO - Using env: {'DISPLAY': ':0', 01:05:02 INFO - 'HOME': '/home/cltbld', 01:05:02 INFO - 'LANG': 'en_US.UTF-8', 01:05:02 INFO - 'LANGUAGE': 'en_US:en', 01:05:02 INFO - 'LOGNAME': 'cltbld', 01:05:02 INFO - 'MAIL': '/var/mail/cltbld', 01:05:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:05:02 INFO - 'MOZ_NO_REMOTE': '1', 01:05:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:05:02 INFO - 'NO_EM_RESTART': '1', 01:05:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:05:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:05:02 INFO - 'PWD': '/builds/slave/test-pgo', 01:05:02 INFO - 'SHELL': '/bin/bash', 01:05:02 INFO - 'SHLVL': '1', 01:05:02 INFO - 'TERM': 'linux', 01:05:02 INFO - 'TMOUT': '86400', 01:05:02 INFO - 'USER': 'cltbld', 01:05:02 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', 01:05:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:05:02 INFO - '_': '/tools/buildbot/bin/python'} 01:05:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:05:02 INFO - Downloading/unpacking blobuploader==1.2.4 01:05:02 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 01:05:02 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 01:05:02 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 01:05:02 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 01:05:02 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 01:05:02 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 01:05:04 INFO - Downloading blobuploader-1.2.4.tar.gz 01:05:04 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 01:05:04 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 01:05:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:05:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:05:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:05:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:05:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:05:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:05:04 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 01:05:04 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 01:05:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:05:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:05:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:05:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:05:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:05:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:05:05 INFO - Downloading docopt-0.6.1.tar.gz 01:05:05 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 01:05:05 INFO - Installing collected packages: blobuploader, requests, docopt 01:05:05 INFO - Running setup.py install for blobuploader 01:05:05 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 01:05:05 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 01:05:05 INFO - Running setup.py install for requests 01:05:05 INFO - Running setup.py install for docopt 01:05:05 INFO - Successfully installed blobuploader requests docopt 01:05:05 INFO - Cleaning up... 01:05:05 INFO - Return code: 0 01:05:05 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 01:05: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')]} 01:05:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:05:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05: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')]} 01:05:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:05:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:05 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 0x7f139d1f4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28748a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2941670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d08c0>, '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 0x29d17c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d1c50>, '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': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', '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 01:05:05 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 01:05:05 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 01:05:05 INFO - Using env: {'DISPLAY': ':0', 01:05:05 INFO - 'HOME': '/home/cltbld', 01:05:05 INFO - 'LANG': 'en_US.UTF-8', 01:05:05 INFO - 'LANGUAGE': 'en_US:en', 01:05:05 INFO - 'LOGNAME': 'cltbld', 01:05:05 INFO - 'MAIL': '/var/mail/cltbld', 01:05:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:05:05 INFO - 'MOZ_NO_REMOTE': '1', 01:05:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:05:05 INFO - 'NO_EM_RESTART': '1', 01:05:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:05:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:05:05 INFO - 'PWD': '/builds/slave/test-pgo', 01:05:05 INFO - 'SHELL': '/bin/bash', 01:05:05 INFO - 'SHLVL': '1', 01:05:05 INFO - 'TERM': 'linux', 01:05:05 INFO - 'TMOUT': '86400', 01:05:05 INFO - 'USER': 'cltbld', 01:05:05 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', 01:05:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:05:05 INFO - '_': '/tools/buildbot/bin/python'} 01:05:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:05:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:05:05 INFO - Running setup.py (path:/tmp/pip-ldFAd4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:05:06 INFO - Running setup.py (path:/tmp/pip-yhqnGg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:05:06 INFO - Running setup.py (path:/tmp/pip-h513ZY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:05:06 INFO - Running setup.py (path:/tmp/pip-NzFUE1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 01:05:06 INFO - Running setup.py (path:/tmp/pip-GE4gmj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:05:06 INFO - Running setup.py (path:/tmp/pip-xA1mt2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:05:06 INFO - Running setup.py (path:/tmp/pip-fWg3ws-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:05:06 INFO - Running setup.py (path:/tmp/pip-kHG43K-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 01:05:06 INFO - Running setup.py (path:/tmp/pip-hDLrCb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 01:05:06 INFO - Running setup.py (path:/tmp/pip-SoR6Cs-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:05:06 INFO - Running setup.py (path:/tmp/pip-hgrTb2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:05:06 INFO - Running setup.py (path:/tmp/pip-r0r989-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:05:06 INFO - Running setup.py (path:/tmp/pip-cI7da_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:05:06 INFO - Running setup.py (path:/tmp/pip-uvnhDF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:05:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:05:06 INFO - Running setup.py (path:/tmp/pip-rCWVsI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:05:07 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 01:05:07 INFO - Running setup.py (path:/tmp/pip-CaBCt3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 01:05:07 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 01:05:07 INFO - Running setup.py (path:/tmp/pip-1ivUto-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 01:05:07 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 01:05:07 INFO - Running setup.py install for manifestparser 01:05:07 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 01:05:07 INFO - Running setup.py install for mozcrash 01:05:07 INFO - Running setup.py install for mozdebug 01:05:07 INFO - Running setup.py install for mozdevice 01:05:07 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 01:05:07 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 01:05:07 INFO - Running setup.py install for mozfile 01:05:07 INFO - Running setup.py install for mozhttpd 01:05:07 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 01:05:07 INFO - Running setup.py install for mozinfo 01:05:07 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 01:05:07 INFO - Running setup.py install for mozInstall 01:05:07 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 01:05:07 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 01:05:07 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 01:05:07 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 01:05:07 INFO - Running setup.py install for mozleak 01:05:08 INFO - Running setup.py install for mozlog 01:05:08 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 01:05:08 INFO - Running setup.py install for moznetwork 01:05:08 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 01:05:08 INFO - Running setup.py install for mozprocess 01:05:08 INFO - Running setup.py install for mozprofile 01:05:08 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 01:05:08 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 01:05:08 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 01:05:08 INFO - Running setup.py install for mozrunner 01:05:08 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 01:05:08 INFO - Running setup.py install for mozscreenshot 01:05:08 INFO - Running setup.py install for moztest 01:05:08 INFO - Running setup.py install for mozversion 01:05:08 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 01:05:08 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 01:05:08 INFO - Cleaning up... 01:05:08 INFO - Return code: 0 01:05:08 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 01:05:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:05:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:05:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:05:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:05:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:08 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 0x7f139d1f4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28748a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2941670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d08c0>, '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 0x29d17c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d1c50>, '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': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', '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 01:05:08 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 01:05:08 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 01:05:08 INFO - Using env: {'DISPLAY': ':0', 01:05:08 INFO - 'HOME': '/home/cltbld', 01:05:08 INFO - 'LANG': 'en_US.UTF-8', 01:05:08 INFO - 'LANGUAGE': 'en_US:en', 01:05:08 INFO - 'LOGNAME': 'cltbld', 01:05:08 INFO - 'MAIL': '/var/mail/cltbld', 01:05:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:05:08 INFO - 'MOZ_NO_REMOTE': '1', 01:05:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:05:08 INFO - 'NO_EM_RESTART': '1', 01:05:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:05:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:05:08 INFO - 'PWD': '/builds/slave/test-pgo', 01:05:08 INFO - 'SHELL': '/bin/bash', 01:05:08 INFO - 'SHLVL': '1', 01:05:08 INFO - 'TERM': 'linux', 01:05:08 INFO - 'TMOUT': '86400', 01:05:08 INFO - 'USER': 'cltbld', 01:05:08 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', 01:05:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:05:08 INFO - '_': '/tools/buildbot/bin/python'} 01:05:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:05:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:05:09 INFO - Running setup.py (path:/tmp/pip-mg8UtN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:05:09 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)) 01:05:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:05:09 INFO - Running setup.py (path:/tmp/pip-xkqXQf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:05:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 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)) 01:05:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:05:09 INFO - Running setup.py (path:/tmp/pip-jqsNpF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:05:09 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)) 01:05:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:05:09 INFO - Running setup.py (path:/tmp/pip-THDwpo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:05:09 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)) 01:05:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 01:05:09 INFO - Running setup.py (path:/tmp/pip-E7Nc9L-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 01:05:09 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)) 01:05:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:05:09 INFO - Running setup.py (path:/tmp/pip-jJsy4j-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:05:09 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)) 01:05:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:05:09 INFO - Running setup.py (path:/tmp/pip-UOdOt_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:05:09 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)) 01:05:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:05:09 INFO - Running setup.py (path:/tmp/pip-rXR8QW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:05:09 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)) 01:05:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 01:05:09 INFO - Running setup.py (path:/tmp/pip-dvFv1H-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 01:05:09 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)) 01:05:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 01:05:09 INFO - Running setup.py (path:/tmp/pip-mWzipB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 01:05:09 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)) 01:05:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:05:09 INFO - Running setup.py (path:/tmp/pip-UHmyTO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:05:09 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)) 01:05:09 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:05:09 INFO - Running setup.py (path:/tmp/pip-qg0Owo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:05:10 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)) 01:05:10 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:05:10 INFO - Running setup.py (path:/tmp/pip-DCoK7L-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:05:10 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)) 01:05:10 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:05:10 INFO - Running setup.py (path:/tmp/pip-eeyfK5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:05:10 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)) 01:05:10 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:05:10 INFO - Running setup.py (path:/tmp/pip-EgCDjL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:05:10 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)) 01:05:10 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 01:05:10 INFO - Running setup.py (path:/tmp/pip-JbEdaQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 01:05:10 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)) 01:05:10 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 01:05:10 INFO - Running setup.py (path:/tmp/pip-TvxBw9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 01:05:10 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)) 01:05:10 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.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 01:05:10 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.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 01:05:10 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)) 01:05:10 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)) 01:05:10 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)) 01:05:10 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 01:05:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:05:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:05:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:05:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:05:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:05:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:05:12 INFO - Downloading blessings-1.6.tar.gz 01:05:12 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 01:05:12 INFO - Installing collected packages: blessings 01:05:12 INFO - Running setup.py install for blessings 01:05:12 INFO - Successfully installed blessings 01:05:12 INFO - Cleaning up... 01:05:12 INFO - Return code: 0 01:05:12 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 01:05:12 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 01:05:12 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 01:05:12 INFO - Reading from file tmpfile_stdout 01:05:12 INFO - Current package versions: 01:05:12 INFO - argparse == 1.2.1 01:05:12 INFO - blessings == 1.6 01:05:12 INFO - blobuploader == 1.2.4 01:05:12 INFO - docopt == 0.6.1 01:05:12 INFO - manifestparser == 1.1 01:05:12 INFO - mozInstall == 1.12 01:05:12 INFO - mozcrash == 0.16 01:05:12 INFO - mozdebug == 0.1 01:05:12 INFO - mozdevice == 0.48 01:05:12 INFO - mozfile == 1.2 01:05:12 INFO - mozhttpd == 0.7 01:05:12 INFO - mozinfo == 0.9 01:05:12 INFO - mozleak == 0.1 01:05:12 INFO - mozlog == 3.1 01:05:12 INFO - moznetwork == 0.27 01:05:12 INFO - mozprocess == 0.22 01:05:12 INFO - mozprofile == 0.28 01:05:12 INFO - mozrunner == 6.11 01:05:12 INFO - mozscreenshot == 0.1 01:05:12 INFO - mozsystemmonitor == 0.0 01:05:12 INFO - moztest == 0.7 01:05:12 INFO - mozversion == 1.4 01:05:12 INFO - psutil == 3.1.1 01:05:12 INFO - requests == 1.2.3 01:05:12 INFO - wsgiref == 0.1.2 01:05:12 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 01:05:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:05:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:05:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:05:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:05:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:12 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 0x7f139d1f4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28748a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2941670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d08c0>, '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 0x29d17c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d1c50>, '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': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', '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 01:05:12 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 01:05:12 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 01:05:12 INFO - Using env: {'DISPLAY': ':0', 01:05:12 INFO - 'HOME': '/home/cltbld', 01:05:12 INFO - 'LANG': 'en_US.UTF-8', 01:05:12 INFO - 'LANGUAGE': 'en_US:en', 01:05:12 INFO - 'LOGNAME': 'cltbld', 01:05:12 INFO - 'MAIL': '/var/mail/cltbld', 01:05:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:05:12 INFO - 'MOZ_NO_REMOTE': '1', 01:05:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:05:12 INFO - 'NO_EM_RESTART': '1', 01:05:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:05:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:05:12 INFO - 'PWD': '/builds/slave/test-pgo', 01:05:12 INFO - 'SHELL': '/bin/bash', 01:05:12 INFO - 'SHLVL': '1', 01:05:12 INFO - 'TERM': 'linux', 01:05:12 INFO - 'TMOUT': '86400', 01:05:12 INFO - 'USER': 'cltbld', 01:05:12 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', 01:05:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:05:12 INFO - '_': '/tools/buildbot/bin/python'} 01:05:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:05:12 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)) 01:05:12 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)) 01:05:12 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)) 01:05:12 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)) 01:05:12 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)) 01:05:12 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)) 01:05:12 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)) 01:05:12 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)) 01:05:12 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)) 01:05:12 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)) 01:05:12 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)) 01:05:12 INFO - Cleaning up... 01:05:12 INFO - Return code: 0 01:05:12 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 01:05:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:05:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:05:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:05:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:05:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:12 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 0x7f139d1f4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28748a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2941670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d08c0>, '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 0x29d17c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d1c50>, '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': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', '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 01:05:12 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 01:05:12 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 01:05:12 INFO - Using env: {'DISPLAY': ':0', 01:05:12 INFO - 'HOME': '/home/cltbld', 01:05:12 INFO - 'LANG': 'en_US.UTF-8', 01:05:12 INFO - 'LANGUAGE': 'en_US:en', 01:05:12 INFO - 'LOGNAME': 'cltbld', 01:05:12 INFO - 'MAIL': '/var/mail/cltbld', 01:05:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:05:12 INFO - 'MOZ_NO_REMOTE': '1', 01:05:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:05:12 INFO - 'NO_EM_RESTART': '1', 01:05:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:05:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:05:12 INFO - 'PWD': '/builds/slave/test-pgo', 01:05:12 INFO - 'SHELL': '/bin/bash', 01:05:12 INFO - 'SHLVL': '1', 01:05:12 INFO - 'TERM': 'linux', 01:05:12 INFO - 'TMOUT': '86400', 01:05:12 INFO - 'USER': 'cltbld', 01:05:12 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', 01:05:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:05:12 INFO - '_': '/tools/buildbot/bin/python'} 01:05:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:05:13 INFO - Downloading/unpacking jsonschema 01:05:13 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 01:05:13 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 01:05:13 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 01:05:13 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 01:05:13 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 01:05:13 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 01:05:14 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 01:05:15 INFO - Downloading/unpacking functools32 (from jsonschema) 01:05:15 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 01:05:15 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 01:05:15 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 01:05:15 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 01:05:15 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 01:05:15 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 01:05:15 INFO - Downloading functools32-3.2.3-2.tar.gz 01:05:15 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 01:05:15 INFO - warning: no files found matching '*.txt' 01:05:15 INFO - no previously-included directories found matching 'build' 01:05:15 INFO - no previously-included directories found matching 'dist' 01:05:15 INFO - no previously-included directories found matching '.git*' 01:05:15 INFO - Installing collected packages: jsonschema, functools32 01:05:15 INFO - Running setup.py install for functools32 01:05:15 INFO - warning: no files found matching '*.txt' 01:05:15 INFO - no previously-included directories found matching 'build' 01:05:15 INFO - no previously-included directories found matching 'dist' 01:05:15 INFO - no previously-included directories found matching '.git*' 01:05:15 INFO - Successfully installed jsonschema functools32 01:05:15 INFO - Cleaning up... 01:05:15 INFO - Return code: 0 01:05:15 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 01:05:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:05:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:05:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:05:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:05:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:05:15 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 0x7f139d1f4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28748a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2941670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29d08c0>, '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 0x29d17c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d1c50>, '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': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', '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 01:05:15 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 01:05:15 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 01:05:15 INFO - Using env: {'DISPLAY': ':0', 01:05:15 INFO - 'HOME': '/home/cltbld', 01:05:15 INFO - 'LANG': 'en_US.UTF-8', 01:05:15 INFO - 'LANGUAGE': 'en_US:en', 01:05:15 INFO - 'LOGNAME': 'cltbld', 01:05:15 INFO - 'MAIL': '/var/mail/cltbld', 01:05:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:05:15 INFO - 'MOZ_NO_REMOTE': '1', 01:05:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:05:15 INFO - 'NO_EM_RESTART': '1', 01:05:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:05:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:05:15 INFO - 'PWD': '/builds/slave/test-pgo', 01:05:15 INFO - 'SHELL': '/bin/bash', 01:05:15 INFO - 'SHLVL': '1', 01:05:15 INFO - 'TERM': 'linux', 01:05:15 INFO - 'TMOUT': '86400', 01:05:15 INFO - 'USER': 'cltbld', 01:05:15 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', 01:05:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:05:15 INFO - '_': '/tools/buildbot/bin/python'} 01:05:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:05:15 INFO - Downloading/unpacking flake8 01:05:15 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 01:05:15 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 01:05:15 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 01:05:15 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 01:05:15 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 01:05:15 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 01:05:17 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 01:05:17 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 01:05:17 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 01:05:17 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 01:05:17 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 01:05:17 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 01:05:17 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 01:05:17 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 01:05:17 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 01:05:17 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 01:05:17 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 01:05:17 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 01:05:17 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 01:05:17 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 01:05:17 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 01:05:17 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 01:05:17 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 01:05:17 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 01:05:17 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 01:05:17 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 01:05:17 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 01:05:17 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 01:05:17 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 01:05:18 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 01:05:18 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 01:05:18 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 01:05:18 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 01:05:18 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 01:05:18 INFO - no previously-included directories found matching 'docs/_build' 01:05:18 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 01:05:18 INFO - Running setup.py install for pep8 01:05:18 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 01:05:18 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 01:05:18 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 01:05:18 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 01:05:18 INFO - no previously-included directories found matching 'docs/_build' 01:05:18 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 01:05:18 INFO - Successfully installed flake8 mccabe pyflakes pep8 01:05:18 INFO - Cleaning up... 01:05:18 INFO - Return code: 0 01:05:18 INFO - Running post-action listener: _resource_record_post_action 01:05:18 INFO - Running post-action listener: _start_resource_monitoring 01:05:18 INFO - Starting resource monitoring. 01:05:18 INFO - ##### 01:05:18 INFO - ##### Running install step. 01:05:18 INFO - ##### 01:05:18 INFO - Running pre-action listener: _resource_record_pre_action 01:05:18 INFO - Running main action method: install 01:05:18 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 01:05:18 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 01:05:18 INFO - Reading from file tmpfile_stdout 01:05:18 INFO - Detecting whether we're running mozinstall >=1.0... 01:05:18 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 01:05:18 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 01:05:18 INFO - Reading from file tmpfile_stdout 01:05:18 INFO - Output received: 01:05:18 INFO - Usage: mozinstall [options] installer 01:05:18 INFO - Options: 01:05:18 INFO - -h, --help show this help message and exit 01:05:18 INFO - -d DEST, --destination=DEST 01:05:18 INFO - Directory to install application into. [default: 01:05:18 INFO - "/builds/slave/test-pgo"] 01:05:18 INFO - --app=APP Application being installed. [default: firefox] 01:05:18 INFO - mkdir: /builds/slave/test-pgo/build/application 01:05:18 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 01:05:18 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 01:05:35 INFO - Reading from file tmpfile_stdout 01:05:35 INFO - Output received: 01:05:35 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 01:05:35 INFO - Running post-action listener: _resource_record_post_action 01:05:35 INFO - ##### 01:05:35 INFO - ##### Running run-tests step. 01:05:35 INFO - ##### 01:05:35 INFO - Running pre-action listener: _resource_record_pre_action 01:05:35 INFO - Running main action method: run_tests 01:05:35 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 01:05:35 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 01:05:35 INFO - Python 2.7.3 01:05:35 INFO - Return code: 0 01:05:35 INFO - grabbing minidump binary from tooltool 01:05:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:05:35 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 0x29d08c0>, '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 0x29d17c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x29d1c50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 01:05:35 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 01:05:35 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 01:05:35 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 01:05:35 INFO - Return code: 0 01:05:35 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 01:05:35 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 01:05:35 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 01:05:35 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 01:05:35 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 01:05:35 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 01:05:35 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 01:05:36 INFO - Return code: 0 01:05:36 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-028', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build 01:05:36 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-028 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log 01:05:36 INFO - Using env: {'DISPLAY': ':0', 01:05:36 INFO - 'HOME': '/home/cltbld', 01:05:36 INFO - 'LANG': 'en_US.UTF-8', 01:05:36 INFO - 'LANGUAGE': 'en_US:en', 01:05:36 INFO - 'LOGNAME': 'cltbld', 01:05:36 INFO - 'MAIL': '/var/mail/cltbld', 01:05:36 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 01:05:36 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 01:05:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:05:36 INFO - 'MOZ_NO_REMOTE': '1', 01:05:36 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 01:05:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:05:36 INFO - 'NO_EM_RESTART': '1', 01:05:36 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:05:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:05:36 INFO - 'PWD': '/builds/slave/test-pgo', 01:05:36 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 01:05:36 INFO - 'SHELL': '/bin/bash', 01:05:36 INFO - 'SHLVL': '1', 01:05:36 INFO - 'TERM': 'linux', 01:05:36 INFO - 'TMOUT': '86400', 01:05:36 INFO - 'USER': 'cltbld', 01:05:36 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553', 01:05:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:05:36 INFO - '_': '/tools/buildbot/bin/python'} 01:05:36 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-028', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 01:05:36 INFO - mozversion application_buildid: 20160229223041 01:05:36 INFO - mozversion application_changeset: 74a8cd912dcd154cdfd0c771d7d4ea73f016191e 01:05:36 INFO - mozversion application_display_name: Nightly 01:05:36 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 01:05:36 INFO - mozversion application_name: Firefox 01:05:36 INFO - mozversion application_remotingname: firefox 01:05:36 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 01:05:36 INFO - mozversion application_vendor: Mozilla 01:05:36 INFO - mozversion application_version: 47.0a1 01:05:36 INFO - mozversion platform_buildid: 20160229223041 01:05:36 INFO - mozversion platform_changeset: 74a8cd912dcd154cdfd0c771d7d4ea73f016191e 01:05:36 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 01:05:36 INFO - mozversion platform_version: 47.0a1 01:05:36 INFO - using testdate: 1456823136 01:05:36 INFO - actual date: 1456823136 01:05:36 INFO - starting webserver on 'localhost:47976' 01:05:36 INFO - SUITE-START | Running 2 tests 01:05:36 INFO - TEST-START | dromaeo_css 01:05:36 INFO - operating with platform_type : linux_ 01:05:36 INFO - Initialising browser for dromaeo_css test... 01:05:36 INFO - TEST-INFO | started process 3373 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpczBR7B/profile http://localhost:47976/getInfo.html) 01:05:42 INFO - PROCESS | 3373 | __metrics Screen width/height:1600/1200 01:05:42 INFO - PROCESS | 3373 | colorDepth:24 01:05:42 INFO - PROCESS | 3373 | Browser inner width/height: 1024/697 01:05:42 INFO - PROCESS | 3373 | __metrics 01:05:43 INFO - PROCESS | 3373 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 01:05:43 INFO - PROCESS | 3373 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:05:43 INFO - PROCESS | 3373 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:05:43 INFO - PROCESS | 3373 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:05:43 INFO - PROCESS | 3373 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:05:43 INFO - PROCESS | 3373 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:05:43 INFO - PROCESS | 3373 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:05:43 INFO - PROCESS | 3373 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 01:05:44 INFO - TEST-INFO | 3373: exit 0 01:05:44 INFO - Browser initialized. 01:05:44 INFO - Running cycle 1/1 for dromaeo_css test... 01:05:44 INFO - TEST-INFO | started process 3470 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpczBR7B/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 01:05:56 INFO - PROCESS | 3470 | RSS: Main: 153399296 01:05:56 INFO - PROCESS | 3470 | 01:06:47 INFO - PROCESS | 3470 | 1456823207505 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] 01:08:55 INFO - PROCESS | 3470 | Cycle 1(1): loaded http://localhost:47976/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47976/tests/dromaeo/cssquery-ext.html) 01:08:56 INFO - PROCESS | 3470 | RSS: Main: 263155712 01:08:56 INFO - PROCESS | 3470 | 01:11:58 INFO - PROCESS | 3470 | Cycle 1(1): loaded http://localhost:47976/tests/dromaeo/cssquery-ext.html (next: http://localhost:47976/tests/dromaeo/cssquery-jquery.html) 01:11:59 INFO - PROCESS | 3470 | RSS: Main: 236642304 01:11:59 INFO - PROCESS | 3470 | 01:15:01 INFO - PROCESS | 3470 | Cycle 1(1): loaded http://localhost:47976/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47976/tests/dromaeo/cssquery-mootools.html) 01:15:02 INFO - PROCESS | 3470 | RSS: Main: 223662080 01:15:02 INFO - PROCESS | 3470 | 01:18:03 INFO - PROCESS | 3470 | Cycle 1(1): loaded http://localhost:47976/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47976/tests/dromaeo/cssquery-prototype.html) 01:18:04 INFO - PROCESS | 3470 | RSS: Main: 212815872 01:18:04 INFO - PROCESS | 3470 | 01:21:07 INFO - PROCESS | 3470 | Cycle 1(1): loaded http://localhost:47976/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47976/tests/dromaeo/cssquery-yui.html) 01:21:07 INFO - PROCESS | 3470 | RSS: Main: 214802432 01:21:07 INFO - PROCESS | 3470 | 01:24:10 INFO - PROCESS | 3470 | Cycle 1(1): loaded http://localhost:47976/tests/dromaeo/cssquery-yui.html (next: http://localhost:47976/tests/dromaeo/cssquery-dojo.html) 01:24:10 INFO - PROCESS | 3470 | RSS: Main: 285200384 01:24:10 INFO - PROCESS | 3470 | 01:24:10 INFO - PROCESS | 3470 | __start_tp_report 01:24:10 INFO - PROCESS | 3470 | _x_x_mozilla_page_load 01:24:10 INFO - PROCESS | 3470 | _x_x_mozilla_page_load_details 01:24:10 INFO - PROCESS | 3470 | |i|pagename|runs| 01:24:10 INFO - PROCESS | 3470 | |0;dojo.html;3107.5494053362277;3116.1742138333343;3121.5161649944266;3150.417172823028;3187.5856138701974;4918.901621967559;4925.679830810995;4958.727270000153;4961.950380496199;5057.49425057494;4976.203807390818;5015.874603134915;5053.242013697947;5071.873203169914;5075.822346217883;4522.90954180917;4541.205289074399;4566.520515345891;4663.393758811367;4739.691920025204;4560.954390456086;4611.723296602215;4647.093816705744;4686.695364801277;4756.191447453941;4585.037142200142;4598.308404647154;4606.585407313341;4631.8842028949375;4641.350210970467;4590.540945905416;4594.977025114853;4605.21058099576;4605.631549476034;4640.303954406832;4514.14231296056;4523.70595911268;4586.403767510203;4605.217113090783;4613;4926.605871530269;4932.0629080474955;4946.134426475388;4946.9010619787405;4961.231009193581;5380.569554435675;5400.945990540084;5405.8107966221;5410.675359478405;5414.214938833887;5307.097793375096;5331.840044798662;5351.357837059539;5366.141417373202;5422.349318081855;5069.9746501267255;5085.262636917701;5098.617603679739;5100.872478188075;5104.438511763703;5272.604554658416;5485.259489968883;5507.614466987353;5507.972460137674;5553.500184983371;5329.920051199235;5362.51737343641;5378.973105134528;5394.73026348681;5429.511343978982;5386.784528618811;5420.403755586883;5440.891182176334;5442.482964118402;5449.891002179934;5202.401723801811;5309.389420216725;5417.024935511567;5430.782768689287;5451.1005684062475;5242.449542798027;5251.8161864335325;5263.078961181778;5265.157574788015;5307.336582927134;4082.1223436961195;4085.7344272622777;4092.0588264699286;4120.938185927213;4129.772862492592;3688.870889518854;3716.1267102230954;3734.495843061152;3748.231612519427;3768.9246215075545;5011.373578302712;5021.698698078127;5034.345535080416;5035.748212589429;5064.5441910228255;5326.2543243945875;5327.520523152857;5336.733163341817;5338.91991620126;5375.865603359947;4953.653244272867;5044.117279476077;5052.267421223902;5169.508896654812;5169.81905633301;4533.070720502289;4545.0909818036525;4563.498015218323;4586.587207151372;4605.907881842344;5494.780208791683;5566.415526369673;5568.136938774496;5579.721013949286;5586.832395028156;5302.045631786315;5317.494837990384;5351.464853514617;5391.730413479232;5408.918866217088;5551.916721249266;5553.4724201200825;5558.24963629921;5574.554035677055;5586.664800112007;5213.895722085461;5274.446183150714;5277.947220527745;5280.960824926563;5320.388155362028;5399.541039011728;5424.403315635198;5438.374586922555;5440.374356949002;5477.315335583052;5230.8169214077325;5231.529162375405;5236.869078272921;5272.261883336259;5318.441563635763;5097.61767867404;5234.162533994542;5252.737363131751;5257.316548848626;5270.920936186037;5140.306058682179;5162.5095615916425;5164.948350516447;5169.896602068013;5229.294045303835;5166.070107380708;5242.711650859087;5248.081585722407;5263.578913686819;5297.099493086262;5125.487451254845;5167.793288268427;5178.559822414986;5207.1668533034535;5245.396779370421 01:24:10 INFO - PROCESS | 3470 | |1;ext.html;523.8114278859613;536.1073812102848;551.3136145498854;555.8715806911968;560.2184951991972;28920.1323960281;36681.26637467252;37128.44307335392;37244.255114897685;37250.25499490012;40342;40919.59080409195;40948;41083.38374924379;41300.380494292534;8447.704330348439;8644.740657780276;8647.567621618893;8648.610812513452;8650.307975361957;8428.452150610221;8572.485650860937;8574.614142363609;8577.785555361104;8823;8769.123087691243;8812.911870881273;8842.557872106401;8850.645974161025;8860.379773415863;8738.213560779528;8794.42836215644;8796.42823216492;8813.779655508599;8816.294696424271;8653.264472519844;8774.166454186841;8782.912170878273;8783.78040548985;8784.956075219647;41254.174916501805;41476.1704765906;41648.79175604103;41671.7916410416;41769.79115104435;3530.1880567469625;3914.608539146091;4119.011437255067;4123.690723195742;4131.731437456556;29972;30070.54894176589;30362.240943976358;31411.84294078515;33350.16624584381;3433.3133373325436;3463.5670541182353;3479.251960828434;3526.5768107827225;3652.7808331499928;270175;273829;274444;275258;275589;45647;46554.534454655695;64123;65573.34426655767;65697.67151164214;46751.53248467472;46871.48463865224;47048.2942755859;47090.293645595346;47120.29319560209;15695.921520392325;15929.840701593068;15939.601509962344;15942.442014529668;15951.840481595267;12725.681857953625;12820.102592818599;12826.422810973529;12835.614931552069;12836.614901552968;14665.706685866224;14940.850591494163;14952.476663316731;14974.625634359229;15084.773728394082;6018.15745795589;6059.454649081604;6075.392460753889;6084.847878803065;6191.81424557264;916.6104405627582;992.2409356842022;1012.7468132966758;1086.3373342261214;1139.0432037088885;29168.27079323034;29207.799787496435;29281.56077658837;29474;29480.852595737313;993.8161440133598;1029.1663752360612;1082.86464191976;1106.070900443615;1131.0781712903956;14672.193029383487;14918.941616968496;15158.924205378902;15263.618409539627;15438.768418473732;306999;308485;310704;310719;310940;54017;54566.181507277426;54601.72699136479;54603.72698136563;54635.726821366436;1183.7387996070943;1261.3945306252867;1349.9797503037462;1354.512375544803;1387.6600232942792;25632.8718356407;26491.470170596866;26656.333591660365;28709.133906296025;28793.424131516833;40978;41046.179076417706;41266.1746765057;41266.79366603148;42490.78754606207;186918;188880;195319;196637;197018.23854091924;33258.667413326526;43668;43898.78050609727;44362.556374435844;44970;44387.33418998653;44878.3268250983;45157;45665.771671142764;46006.53993460022;37156.81421592983;37267.8136609326;37421.251574967806;37740.43389349107;37865.432018520296;36415.27169456649;36545.817270913474;37287.81356093202;37612.811935940146;37941.241175176896;36056.4591531122;36074.27851442904;36686.63313366832;36833.44749828701;36885;32167.195820104684;32397.51403728993;32470;32990.34019319648;33035;25241.87379063093;25432.364190895376;25452.618210726483;25519.87240063788;25684.229473115836 01:24:10 INFO - PROCESS | 3470 | |2;jquery.html;328.73701039168674;337.8682313897579;356.27320266656017;356.8215892053973;359.78412952228666;16427.589310267234;17058.061806600646;17240.137993100358;17903.373381931637;17946.551336216602;11044.834327485094;11058.723531911706;11164.776704465927;13078.934605326984;16196.190190490488;4717.174494463472;4894.388201474816;4904.828331008415;4917.729524876148;4918.803247870081;3670.724695647824;4005.1388951375448;5859.7656093756195;5881.764729410818;5915.5859089863725;5841.211436456067;5853.239078919734;5861.325947516048;5873.76504939804;5880.852978675546;5752.137179423099;5766.336871259796;5910.054391297372;5920.259967504062;5923.259592550931;5262.736863156865;5268.525832675077;5274.103402421598;5276.736163191864;5349.625526213166;14250.073745206528;20025.899870500554;20504.38486845382;20514.69227961567;20568;2091.72807535021;2101.4116047506723;2172.2025795528207;2278.5670722562827;2652.2175958092216;9084.954575227148;9180.357374983754;9312.906870931272;9322.207612352959;9531.714048578553;1747.772789537352;1843.294952169238;1859.3678149429259;1863.319888240796;1896.3836753055175;43017.35473967893;59000.70499647517;63706.68146659283;66305.66847165782;66784;9664.951675241578;10066.69799906004;10390.740231494274;10437.843432348522;10584.312019718695;13608.523701670394;13706.52027179044;13791.241481718402;13792.103513271606;13803.792943105862;7491.513051651626;7528.209537998431;7593.316601505891;7681.155072941972;7687.461877668621;7434.25657434263;7524.247575242432;7552.207018263003;7645.923540764632;7663.578503182379;4448.977755111204;4545.272756358967;4553.2942393929;4589.977050114728;4640.419947506562;1833.6241070580766;1836.7704036995376;1846.6491366640296;1849.2880241107002;1892.7634045744283;926.323783637948;950.9904900950902;960.313375936209;1021.1065317846884;1053.9262251642313;14664.633384165269;15928;16757.664846703;16944.15279236033;17290.654186916192;912.6349460215966;979.1530326267728;1001.9348742331871;1022.9897701022894;1050.5430137890041;9192.310576706774;9619.470929098827;9659.46872921996;9718.12536871685;9871.654492092743;315068;315831;317907;319536;320013;60298.39701602928;73378.63310683519;78454.607726961;78476.21523784804;79443.60278198573;1024.0680980307884;1037.123630532214;1057.1173070486077;1064.3401091323428;1067.530286673861;14378.784318235026;14528.418863245352;14970.47603333878;15463.304151313443;15591.298391572633;34206.48690269598;34584.30831383409;35082.82458587691;35351.29297414089;35998.280034399686;44248.7787561073;46430.767846160554;48611.75694121507;50086.749566251936;50550.494495054576;7841.176676448891;7885.422915416825;8032.598370081356;8072.475289106189;8095.878561821695;11494.540218391505;12595.370231488205;12683.302418367079;12826.358682065673;12851.228926264454;10438.425886576311;10851.131909447384;11029.83455248188;11079.778404431705;11120.11039116885;10396.58413663445;10841.457927103771;10844.945775271073;10950.616728414467;11203.495842686936;10641.733956651145;11317.151213658844;11349.375784331942;11368.829467558158;11603.013743831869;7706.229377062249;7759.961200194189;7860.0567931848545;7915.802104947192;8060.727814258453;9154.954225228832;10837.669900971014;10971.561137554727;10976.506057227603;11239.605376888929 01:24:10 INFO - PROCESS | 3470 | |3;mootools.html;1360.0003997062163;1464.7363474574577;1489.456348432822;1674.9162541872904;1839.1264149528968;7308.561486310825;7377.963110184448;7389.298016688413;7391.926080739191;7394.075740532434;7624.695012199505;7748.651310691032;7751.224877512246;7756.806079848006;7759.1852855450215;1936.6514027475048;1988.6619274723332;2220.8667479951255;2256.345659758672;2292.449812045114;2254.41385239838;2262.909483620653;2265.184533567914;2265.365697604673;2267.1498188179435;2207.75714671386;2231.6429371300596;2286.017012684545;2287.405274628592;2289.6679981402685;2184.8252139828774;2194.440417693486;2201.1305534313856;2202.2292197730826;2211.1929145861804;2232.218723446797;2258.108047321315;2283.235116236063;2293.0254641777346;2293.495431005176;7886.487378320391;7945.165757595427;7955;7967.641456134488;7969.043714754266;4713.693609915379;4791.496892826238;4822.204336284509;4825.034993001414;4825.348577942003;3131.8590663419973;3142.1359126240236;3171.4291427543035;3209.326041531281;3210.678932106794;1009.2228983682523;1017.1760873692333;1027.203916964351;1032.390889375272;1059.5708737961138;10713.678589642323;10761.30051546647;10774.40740759258;10775.892241077567;10787.892121078845;4118.588141185857;4212.957870421318;4267.658587313008;4268.509121451011;4276.5295817460055;9192.678256260999;9284.814303713887;9329.533523323807;9336.439813611205;9355.345125841262;4794.7842347094465;4795.424549054136;4808.903821923542;4810.182269014276;4811.254255590389;3826.1199924017633;4212.515560710496;4256.787160641956;4308.138372325485;4308.2460569400855;3601.585817631006;3677.1174918019483;3688.354537955847;3722.925541489209;3764.924701506009;1146.7247860513417;1184.988150118505;1189.1200511621512;1199.3283761093815;1207.3118322556234;1349.5006847466304;1364.270115488209;1369.1306020676743;1377.9104358216885;1388.6528367908022;7522.511036782592;7633.694652213961;7640.579768112807;7652.196519365498;7654.4259180561685;464.85589467265254;465.4554171619214;466.571495366616;467.90174063447057;476.43304467683345;5665.178549110438;5734.885302293931;5743.913841292384;5755.136729490526;5792.82621521355;9020.368574199743;9074.727758167266;9115.680951166678;9226.49254291007;9235.722928312161;9046.366754327266;9124.270058395312;9177.174054335143;9196.08039196075;9197.264218862609;7499.9500069990245;7510.248975102555;7619.314261716361;7647.502912310682;7723.34351580122;7397.066322110327;7452.217517160837;7475.514091584029;7476.102867655916;7484.0270764800225;8475.74572762818;8548.871766923377;8576.571171441528;8765.254953328784;8765.517896515752;8569.528675922884;8838.734837954871;8941.776455588662;8999.10008999121;9006.099390060941;6185.597936134137;6525.8694826104165;6655.534112612264;7064.540804847668;7166.498345115792;7459.776206713807;7493.400527957641;7499.325060744559;7502.587357695379;7512.737054203077;6620.768273110611;6720.663966801738;6788.321167883172;6855.143107111611;6972.372486476039;6713.362230588086;6747.898781518379;6786.660666966731;6907.34380233877;6935.063766391674;7076.115485564304;7122.5726456412785;7146.464015198777;7163.140423149255;7181.784546463615;6535.836604084936;6556.8360790980605;6617.569857959217;6620.470362370903;6623.138991931018;6519.869602608016;6656.567323123982;6658.43403310724;6661.367170118831;6684.565503242274 01:24:10 INFO - PROCESS | 3470 | |4;prototype.html;313.56727715752265;317.2386272944933;321.8117401320227;333.6513343555985;336.4952571143285;5721.856953576157;5801.854953626162;5838.4453476919625;5868.325142608602;5885.823425297237;5748.425157484249;5751.223584816049;5758.942410575893;5759.424057594239;5759.884802303952;4251.447311849463;4360.062586543892;4420.46954365475;4446.421965144526;4455.353973673816;4456.955430445702;4479.977600111994;4487.730736155825;4496.910061798762;4501.932471012938;4231.957680423203;4450.221211288028;4454.198244316021;4460.197164510387;4460.4647442306805;4340.283853164224;4435.4899186593475;4445.466544014706;4447.288433850568;4453.732776033448;3912.765234085964;3923.9607603923882;3925.1168487090463;3930.997595613129;3931.4692516510477;5553.805616803393;5554.472325129106;5554.694491802949;5559.471850174227;5560.082586373243;5184.870378240536;5188.403333616645;5189.325387699612;5190.221466779975;5194.27280180775;6142.385761423867;6144.938550614482;6153.323134455206;6157.876842463125;6211.565190436671;4100.077482566428;4224.2185195738575;4246.40550322955;4272.188284226018;4368.737875727435;6331.430171284561;6369.394907483782;6384.585001974857;6396.136521569575;6398.5521013528605;4315.0722594641675;4316.223079845658;4316.676249281317;4318;4319.956800431955;4359.062801497693;4367.27939889921;4368.148211098869;4369.43197384338;4375.956240437555;5082;5089.211172268304;5090.643654944119;5092.898142037138;5093.414257360451;6018.398160183947;6121.143039974407;6173.81478555644;6176.197094377702;6183.134361189437;1524.7789070584704;1534.7621118726615;1541.6993686231078;1542.8302886682457;1544.0967034284845;945.8013817098487;986.2701600815345;1003.9297249192632;1010.6917390195914;1041.8124737547162;5836.124581312837;5840.065589505659;5893.528517718572;5963;5969.492593129546;6293.685315734195;6295.276043254993;6306.810795676137;6335.144755458046;6372.458341041063;5943.762249509971;5948;5948.10778383246;5949;5954.851128721816;3358;3395.049386171876;3397.235621985083;3397.4224381855142;3398.4052790761516;6493.480521558264;6586.934130658728;6612.636305003175;6757.797266082025;6764.154480689914;6472.482201423874;6483.254425741005;6524.412802847766;6533.346665333429;6538.084668146464;6750.594964302158;6754.966225168842;6759.932400676029;6761.154855643044;6764.188297404343;6381.234251889618;6391.680415979089;6394.6482943436695;6397.520185985976;6399.456046236122;5723.513501352431;5991.820245392645;6330.683465826783;6345.746170153142;6347.777827776005;6503.674816259263;6610.735570577123;6740.561863478858;6752.426043786137;6760.053592496956;4316.136772645421;4364.039911219526;4364.388985541963;4364.519902810752;4365.476142862877;6404.615723056631;6405.93594064072;6408.935910640834;6409.423151916163;6411.487081033413;6211.720472578654;6213.813585592439;6222.191115155001;6224.657643829632;6225.750969961332;5949.434803693643;6031.60794548353;6193.84515387119;6207.286162091417;6217.658028808278;5950.166976623363;6011.128386383863;6022;6030.6080104793045;6033.487153591994;6231.034189700604;6245.500359971101;6248;6252.187215661935;6254.687265636609;6088.208532890696;6099.75600975956;6102.206713127265;6116.602420842631;6117.143599895929 01:24:10 INFO - PROCESS | 3470 | |5;yui.html;714.2857142857143;748.5695724958149;751.9435193553056;785.9685612575497;827.9420440569161;13869.167849929;13972.37124329405;14040.64898377541;14068.929655351722;14085.154890706564;13384.866151338483;13515.864841351584;13593.456261749543;13610.863891361083;13671.863281367183;683.0198664915837;807.4953154278576;809.4050872608614;823.8105235795771;830.6926437218237;831.2311112221171;833.2625626320689;834.7662654456761;835.1773503099442;835.2232423845821;869.6347534035721;869.9043105258417;871.4030888841132;872.1235158665532;872.6640243506232;704.4082970304943;712.4371746320375;844.8563744163507;861.0829466618031;866.51908190954;628.1802248066272;629.8425393651587;630.9842253943642;632.4276529740592;632.6330728177646;13871.306434678225;13887.375068121959;13890.166590004632;13901.165930044128;13904.235267060307;12849.550265740654;13038.153744645353;13271.601851944457;13332.06675532713;13617.727645447036;9988.200943924468;10064.345817521838;10716.517756700967;10864.076553492963;11021.614243501519;3591.3715099857423;3606.459031145323;3643.3441980443777;3658.34149853029;3779.225258821935;48348.03303933937;48404.51595484035;48435.757821211024;48497.27254091156;48546.514534854556;10006.949965250127;10186.388816671024;10193.592256309812;10263.2302577307;10620.628278010232;18689.25242990265;18720;18732.969686667093;18779.624407512045;18819.247230110916;7535.472516923873;7585.431092667962;7626.580538070349;7674.501157424861;7679.731209407756;4206.516250631155;4384.364267181241;4446;4447.62195213404;4449.7330160190495;3032.378362435695;3033.9696603034126;3036.2864726789185;3072.4776787946103;3098.2873938994157;532.5686194182724;549.4011527435115;550.3835704011452;552.2434265056897;552.5551930695829;645.6223109481007;663.6681659170415;667.5260564998905;683.2143035509105;713.1513498936353;8001.4398992071165;8237.958810205912;8447.281981031558;8497.490150590984;8522.446041007315;665.7569986954824;669.0900375489331;680.5066326913047;686.27255109584;705.3334598804183;3906.257811015898;3962.187751510933;4010.6590939769862;4055.1686904185162;4089.995862144615;60979.08531372033;61141.38858611357;62159;62207.6889615549;62250;51931.44205673836;52672;53061.30611061375;53359;53724.99999999922;48130.75934620375;48317.5168248313;48704;48704.512954870705;48804.26793598099;8072.798180045545;8203.83592328162;8233.22985558084;8322.875156872531;8328.208820162075;36550.26899462049;36584.634153658124;37373.4393984085;37566.812165938994;37654.43518347172;42799;43910;46190.76904615456;46519;47031.05937881292;10438.947805260925;10605.204609654153;10676.383013625187;10967.177461690564;11039.172062095215;10155.39067655943;10307.226957978031;10515.815619108518;11012.724681882697;11066.557337706723;10547.208959328234;10883.727906802076;10913.399763012792;10944.452777361259;11241.66275011751;10293.691189264335;10366.429846358522;10601.25791194609;10673.46632668379;10974.725631859268;10456.26806123564;10582.4708764563;10787;10830.891691082988;11123.666290011313;9391;9432.905670943202;9456.574454149442;9589.712308630753;9629.614815407305;8148.185181482041;8449.281811045885;8726.30189584819;8984.550772461482;9151.77120571991 01:24:10 INFO - PROCESS | 3470 | __end_tp_report 01:24:10 INFO - PROCESS | 3470 | __start_cc_report 01:24:10 INFO - PROCESS | 3470 | _x_x_mozilla_cycle_collect,895 01:24:10 INFO - PROCESS | 3470 | __end_cc_report 01:24:10 INFO - PROCESS | 3470 | __startTimestamp1456824250696__endTimestamp 01:24:10 INFO - PROCESS | 3470 | 01:24:10 INFO - PROCESS | 3470 | ------- Summary: start ------- 01:24:10 INFO - PROCESS | 3470 | Number of tests: 6 01:24:10 INFO - PROCESS | 3470 | 01:24:10 INFO - PROCESS | 3470 | [#0] dojo.html Cycles:165 Average:5000.12 Median:5169.90 stddev:533.62 (10.3%) stddev-sans-first:514.19 01:24:10 INFO - PROCESS | 3470 | Values: 3107.5 3116.2 3121.5 3150.4 3187.6 4918.9 4925.7 4958.7 4962.0 5057.5 4976.2 5015.9 5053.2 5071.9 5075.8 4522.9 4541.2 4566.5 4663.4 4739.7 4561.0 4611.7 4647.1 4686.7 4756.2 4585.0 4598.3 4606.6 4631.9 4641.4 4590.5 4595.0 4605.2 4605.6 4640.3 4514.1 4523.7 4586.4 4605.2 4613.0 4926.6 4932.1 4946.1 4946.9 4961.2 5380.6 5400.9 5405.8 5410.7 5414.2 5307.1 5331.8 5351.4 5366.1 5422.3 5070.0 5085.3 5098.6 5100.9 5104.4 5272.6 5485.3 5507.6 5508.0 5553.5 5329.9 5362.5 5379.0 5394.7 5429.5 5386.8 5420.4 5440.9 5442.5 5449.9 5202.4 5309.4 5417.0 5430.8 5451.1 5242.4 5251.8 5263.1 5265.2 5307.3 4082.1 4085.7 4092.1 4120.9 4129.8 3688.9 3716.1 3734.5 3748.2 3768.9 5011.4 5021.7 5034.3 5035.7 5064.5 5326.3 5327.5 5336.7 5338.9 5375.9 4953.7 5044.1 5052.3 5169.5 5169.8 4533.1 4545.1 4563.5 4586.6 4605.9 5494.8 5566.4 5568.1 5579.7 5586.8 5302.0 5317.5 5351.5 5391.7 5408.9 5551.9 5553.5 5558.2 5574.6 5586.7 5213.9 5274.4 5277.9 5281.0 5320.4 5399.5 5424.4 5438.4 5440.4 5477.3 5230.8 5231.5 5236.9 5272.3 5318.4 5097.6 5234.2 5252.7 5257.3 5270.9 5140.3 5162.5 5164.9 5169.9 5229.3 5166.1 5242.7 5248.1 5263.6 5297.1 5125.5 5167.8 5178.6 5207.2 5245.4 01:24:10 INFO - PROCESS | 3470 | 01:24:10 INFO - PROCESS | 3470 | [#1] ext.html Cycles:180 Average:43294.57 Median:37247.26 stddev:68729.94 (184.5%) stddev-sans-first:68847.71 01:24:10 INFO - PROCESS | 3470 | Values: 523.8 536.1 551.3 555.9 560.2 28920.1 36681.3 37128.4 37244.3 37250.3 40342.0 40919.6 40948.0 41083.4 41300.4 8447.7 8644.7 8647.6 8648.6 8650.3 8428.5 8572.5 8574.6 8577.8 8823.0 8769.1 8812.9 8842.6 8850.6 8860.4 8738.2 8794.4 8796.4 8813.8 8816.3 8653.3 8774.2 8782.9 8783.8 8785.0 41254.2 41476.2 41648.8 41671.8 41769.8 3530.2 3914.6 4119.0 4123.7 4131.7 29972.0 30070.5 30362.2 31411.8 33350.2 3433.3 3463.6 3479.3 3526.6 3652.8 270175.0 273829.0 274444.0 275258.0 275589.0 45647.0 46554.5 64123.0 65573.3 65697.7 46751.5 46871.5 47048.3 47090.3 47120.3 15695.9 15929.8 15939.6 15942.4 15951.8 12725.7 12820.1 12826.4 12835.6 12836.6 14665.7 14940.9 14952.5 14974.6 15084.8 6018.2 6059.5 6075.4 6084.8 6191.8 916.6 992.2 1012.7 1086.3 1139.0 29168.3 29207.8 29281.6 29474.0 29480.9 993.8 1029.2 1082.9 1106.1 1131.1 14672.2 14918.9 15158.9 15263.6 15438.8 306999.0 308485.0 310704.0 310719.0 310940.0 54017.0 54566.2 54601.7 54603.7 54635.7 1183.7 1261.4 1350.0 1354.5 1387.7 25632.9 26491.5 26656.3 28709.1 28793.4 40978.0 41046.2 41266.2 41266.8 42490.8 186918.0 188880.0 195319.0 196637.0 197018.2 33258.7 43668.0 43898.8 44362.6 44970.0 44387.3 44878.3 45157.0 45665.8 46006.5 37156.8 37267.8 37421.3 37740.4 37865.4 36415.3 36545.8 37287.8 37612.8 37941.2 36056.5 36074.3 36686.6 36833.4 36885.0 32167.2 32397.5 32470.0 32990.3 33035.0 25241.9 25432.4 25452.6 25519.9 25684.2 01:24:10 INFO - PROCESS | 3470 | 01:24:10 INFO - PROCESS | 3470 | [#2] jquery.html Cycles:180 Average:21822.36 Median:34395.40 stddev:52678.37 (153.2%) stddev-sans-first:52801.43 01:24:10 INFO - PROCESS | 3470 | Values: 328.7 337.9 356.3 356.8 359.8 16427.6 17058.1 17240.1 17903.4 17946.6 11044.8 11058.7 11164.8 13078.9 16196.2 4717.2 4894.4 4904.8 4917.7 4918.8 3670.7 4005.1 5859.8 5881.8 5915.6 5841.2 5853.2 5861.3 5873.8 5880.9 5752.1 5766.3 5910.1 5920.3 5923.3 5262.7 5268.5 5274.1 5276.7 5349.6 14250.1 20025.9 20504.4 20514.7 20568.0 2091.7 2101.4 2172.2 2278.6 2652.2 9085.0 9180.4 9312.9 9322.2 9531.7 1747.8 1843.3 1859.4 1863.3 1896.4 43017.4 59000.7 63706.7 66305.7 66784.0 9665.0 10066.7 10390.7 10437.8 10584.3 13608.5 13706.5 13791.2 13792.1 13803.8 7491.5 7528.2 7593.3 7681.2 7687.5 7434.3 7524.2 7552.2 7645.9 7663.6 4449.0 4545.3 4553.3 4590.0 4640.4 1833.6 1836.8 1846.6 1849.3 1892.8 926.3 951.0 960.3 1021.1 1053.9 14664.6 15928.0 16757.7 16944.2 17290.7 912.6 979.2 1001.9 1023.0 1050.5 9192.3 9619.5 9659.5 9718.1 9871.7 315068.0 315831.0 317907.0 319536.0 320013.0 60298.4 73378.6 78454.6 78476.2 79443.6 1024.1 1037.1 1057.1 1064.3 1067.5 14378.8 14528.4 14970.5 15463.3 15591.3 34206.5 34584.3 35082.8 35351.3 35998.3 44248.8 46430.8 48611.8 50086.7 50550.5 7841.2 7885.4 8032.6 8072.5 8095.9 11494.5 12595.4 12683.3 12826.4 12851.2 10438.4 10851.1 11029.8 11079.8 11120.1 10396.6 10841.5 10844.9 10950.6 11203.5 10641.7 11317.2 11349.4 11368.8 11603.0 7706.2 7760.0 7860.1 7915.8 8060.7 9155.0 10837.7 10971.6 10976.5 11239.6 01:24:10 INFO - PROCESS | 3470 | 01:24:10 INFO - PROCESS | 3470 | [#3] mootools.html Cycles:180 Average:5475.51 Median:6352.73 stddev:2867.82 (45.1%) stddev-sans-first:2859.18 01:24:10 INFO - PROCESS | 3470 | Values: 1360.0 1464.7 1489.5 1674.9 1839.1 7308.6 7378.0 7389.3 7391.9 7394.1 7624.7 7748.7 7751.2 7756.8 7759.2 1936.7 1988.7 2220.9 2256.3 2292.4 2254.4 2262.9 2265.2 2265.4 2267.1 2207.8 2231.6 2286.0 2287.4 2289.7 2184.8 2194.4 2201.1 2202.2 2211.2 2232.2 2258.1 2283.2 2293.0 2293.5 7886.5 7945.2 7955.0 7967.6 7969.0 4713.7 4791.5 4822.2 4825.0 4825.3 3131.9 3142.1 3171.4 3209.3 3210.7 1009.2 1017.2 1027.2 1032.4 1059.6 10713.7 10761.3 10774.4 10775.9 10787.9 4118.6 4213.0 4267.7 4268.5 4276.5 9192.7 9284.8 9329.5 9336.4 9355.3 4794.8 4795.4 4808.9 4810.2 4811.3 3826.1 4212.5 4256.8 4308.1 4308.2 3601.6 3677.1 3688.4 3722.9 3764.9 1146.7 1185.0 1189.1 1199.3 1207.3 1349.5 1364.3 1369.1 1377.9 1388.7 7522.5 7633.7 7640.6 7652.2 7654.4 464.9 465.5 466.6 467.9 476.4 5665.2 5734.9 5743.9 5755.1 5792.8 9020.4 9074.7 9115.7 9226.5 9235.7 9046.4 9124.3 9177.2 9196.1 9197.3 7500.0 7510.2 7619.3 7647.5 7723.3 7397.1 7452.2 7475.5 7476.1 7484.0 8475.7 8548.9 8576.6 8765.3 8765.5 8569.5 8838.7 8941.8 8999.1 9006.1 6185.6 6525.9 6655.5 7064.5 7166.5 7459.8 7493.4 7499.3 7502.6 7512.7 6620.8 6720.7 6788.3 6855.1 6972.4 6713.4 6747.9 6786.7 6907.3 6935.1 7076.1 7122.6 7146.5 7163.1 7181.8 6535.8 6556.8 6617.6 6620.5 6623.1 6519.9 6656.6 6658.4 6661.4 6684.6 01:24:10 INFO - PROCESS | 3470 | 01:24:10 INFO - PROCESS | 3470 | [#4] prototype.html Cycles:180 Average:5157.07 Median:5889.68 stddev:1570.29 (26.7%) stddev-sans-first:1532.03 01:24:10 INFO - PROCESS | 3470 | Values: 313.6 317.2 321.8 333.7 336.5 5721.9 5801.9 5838.4 5868.3 5885.8 5748.4 5751.2 5758.9 5759.4 5759.9 4251.4 4360.1 4420.5 4446.4 4455.4 4457.0 4480.0 4487.7 4496.9 4501.9 4232.0 4450.2 4454.2 4460.2 4460.5 4340.3 4435.5 4445.5 4447.3 4453.7 3912.8 3924.0 3925.1 3931.0 3931.5 5553.8 5554.5 5554.7 5559.5 5560.1 5184.9 5188.4 5189.3 5190.2 5194.3 6142.4 6144.9 6153.3 6157.9 6211.6 4100.1 4224.2 4246.4 4272.2 4368.7 6331.4 6369.4 6384.6 6396.1 6398.6 4315.1 4316.2 4316.7 4318.0 4320.0 4359.1 4367.3 4368.1 4369.4 4376.0 5082.0 5089.2 5090.6 5092.9 5093.4 6018.4 6121.1 6173.8 6176.2 6183.1 1524.8 1534.8 1541.7 1542.8 1544.1 945.8 986.3 1003.9 1010.7 1041.8 5836.1 5840.1 5893.5 5963.0 5969.5 6293.7 6295.3 6306.8 6335.1 6372.5 5943.8 5948.0 5948.1 5949.0 5954.9 3358.0 3395.0 3397.2 3397.4 3398.4 6493.5 6586.9 6612.6 6757.8 6764.2 6472.5 6483.3 6524.4 6533.3 6538.1 6750.6 6755.0 6759.9 6761.2 6764.2 6381.2 6391.7 6394.6 6397.5 6399.5 5723.5 5991.8 6330.7 6345.7 6347.8 6503.7 6610.7 6740.6 6752.4 6760.1 4316.1 4364.0 4364.4 4364.5 4365.5 6404.6 6405.9 6408.9 6409.4 6411.5 6211.7 6213.8 6222.2 6224.7 6225.8 5949.4 6031.6 6193.8 6207.3 6217.7 5950.2 6011.1 6022.0 6030.6 6033.5 6231.0 6245.5 6248.0 6252.2 6254.7 6088.2 6099.8 6102.2 6116.6 6117.1 01:24:10 INFO - PROCESS | 3470 | 01:24:10 INFO - PROCESS | 3470 | [#5] yui.html Cycles:180 Average:14055.64 Median:48332.77 stddev:16676.59 (34.5%) stddev-sans-first:16693.27 01:24:10 INFO - PROCESS | 3470 | Values: 714.3 748.6 751.9 786.0 827.9 13869.2 13972.4 14040.6 14068.9 14085.2 13384.9 13515.9 13593.5 13610.9 13671.9 683.0 807.5 809.4 823.8 830.7 831.2 833.3 834.8 835.2 835.2 869.6 869.9 871.4 872.1 872.7 704.4 712.4 844.9 861.1 866.5 628.2 629.8 631.0 632.4 632.6 13871.3 13887.4 13890.2 13901.2 13904.2 12849.6 13038.2 13271.6 13332.1 13617.7 9988.2 10064.3 10716.5 10864.1 11021.6 3591.4 3606.5 3643.3 3658.3 3779.2 48348.0 48404.5 48435.8 48497.3 48546.5 10006.9 10186.4 10193.6 10263.2 10620.6 18689.3 18720.0 18733.0 18779.6 18819.2 7535.5 7585.4 7626.6 7674.5 7679.7 4206.5 4384.4 4446.0 4447.6 4449.7 3032.4 3034.0 3036.3 3072.5 3098.3 532.6 549.4 550.4 552.2 552.6 645.6 663.7 667.5 683.2 713.2 8001.4 8238.0 8447.3 8497.5 8522.4 665.8 669.1 680.5 686.3 705.3 3906.3 3962.2 4010.7 4055.2 4090.0 60979.1 61141.4 62159.0 62207.7 62250.0 51931.4 52672.0 53061.3 53359.0 53725.0 48130.8 48317.5 48704.0 48704.5 48804.3 8072.8 8203.8 8233.2 8322.9 8328.2 36550.3 36584.6 37373.4 37566.8 37654.4 42799.0 43910.0 46190.8 46519.0 47031.1 10438.9 10605.2 10676.4 10967.2 11039.2 10155.4 10307.2 10515.8 11012.7 11066.6 10547.2 10883.7 10913.4 10944.5 11241.7 10293.7 10366.4 10601.3 10673.5 10974.7 10456.3 10582.5 10787.0 10830.9 11123.7 9391.0 9432.9 9456.6 9589.7 9629.6 8148.2 8449.3 8726.3 8984.6 9151.8 01:24:10 INFO - PROCESS | 3470 | -------- Summary: end -------- 01:24:10 INFO - PROCESS | 3470 | 01:24:10 INFO - PROCESS | 3470 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:24:10 INFO - PROCESS | 3470 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:24:10 INFO - PROCESS | 3470 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:24:10 INFO - PROCESS | 3470 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:24:10 INFO - PROCESS | 3470 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:24:11 INFO - TEST-INFO | 3470: exit 0 01:24:11 INFO - TEST-OK | dromaeo_css | took 1114649ms 01:24:11 INFO - TEST-START | kraken 01:24:11 INFO - operating with platform_type : linux_ 01:24:11 INFO - Initialising browser for kraken test... 01:24:11 INFO - TEST-INFO | started process 3662 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpPC3yMV/profile http://localhost:47976/getInfo.html) 01:24:15 INFO - PROCESS | 3662 | __metrics Screen width/height:1600/1200 01:24:15 INFO - PROCESS | 3662 | colorDepth:24 01:24:15 INFO - PROCESS | 3662 | Browser inner width/height: 1024/697 01:24:15 INFO - PROCESS | 3662 | __metrics 01:24:16 INFO - PROCESS | 3662 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 01:24:16 INFO - PROCESS | 3662 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:24:16 INFO - PROCESS | 3662 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:24:16 INFO - PROCESS | 3662 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:24:16 INFO - PROCESS | 3662 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:24:16 INFO - PROCESS | 3662 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:24:16 INFO - PROCESS | 3662 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:24:16 INFO - PROCESS | 3662 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 01:24:17 INFO - TEST-INFO | 3662: exit 0 01:24:17 INFO - Browser initialized. 01:24:17 INFO - Running cycle 1/1 for kraken test... 01:24:17 INFO - TEST-INFO | started process 3746 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpPC3yMV/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 01:24:29 INFO - PROCESS | 3746 | RSS: Main: 153440256 01:24:29 INFO - PROCESS | 3746 | 01:24:31 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47976/tests/kraken/driver.html?testName=audio-beat-detection) 01:24:32 INFO - PROCESS | 3746 | RSS: Main: 198877184 01:24:32 INFO - PROCESS | 3746 | 01:24:34 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47976/tests/kraken/driver.html?testName=audio-dft) 01:24:35 INFO - PROCESS | 3746 | RSS: Main: 187502592 01:24:35 INFO - PROCESS | 3746 | 01:24:38 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47976/tests/kraken/driver.html?testName=audio-fft) 01:24:38 INFO - PROCESS | 3746 | RSS: Main: 172187648 01:24:38 INFO - PROCESS | 3746 | 01:24:40 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47976/tests/kraken/driver.html?testName=audio-oscillator) 01:24:41 INFO - PROCESS | 3746 | RSS: Main: 174354432 01:24:41 INFO - PROCESS | 3746 | 01:24:43 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47976/tests/kraken/driver.html?testName=imaging-gaussian-blur) 01:24:44 INFO - PROCESS | 3746 | RSS: Main: 174710784 01:24:44 INFO - PROCESS | 3746 | 01:24:47 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47976/tests/kraken/driver.html?testName=imaging-darkroom) 01:24:47 INFO - PROCESS | 3746 | RSS: Main: 175652864 01:24:47 INFO - PROCESS | 3746 | 01:24:51 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47976/tests/kraken/driver.html?testName=imaging-desaturate) 01:24:51 INFO - PROCESS | 3746 | RSS: Main: 175697920 01:24:51 INFO - PROCESS | 3746 | 01:24:54 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47976/tests/kraken/driver.html?testName=json-parse-financial) 01:24:55 INFO - PROCESS | 3746 | RSS: Main: 175562752 01:24:55 INFO - PROCESS | 3746 | 01:24:56 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47976/tests/kraken/driver.html?testName=json-stringify-tinderbox) 01:24:57 INFO - PROCESS | 3746 | RSS: Main: 189128704 01:24:57 INFO - PROCESS | 3746 | 01:24:59 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47976/tests/kraken/driver.html?testName=stanford-crypto-aes) 01:24:59 INFO - PROCESS | 3746 | RSS: Main: 185290752 01:24:59 INFO - PROCESS | 3746 | 01:25:02 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47976/tests/kraken/driver.html?testName=stanford-crypto-ccm) 01:25:02 INFO - PROCESS | 3746 | RSS: Main: 198365184 01:25:02 INFO - PROCESS | 3746 | 01:25:04 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47976/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 01:25:05 INFO - PROCESS | 3746 | RSS: Main: 203128832 01:25:05 INFO - PROCESS | 3746 | 01:25:08 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47976/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 01:25:08 INFO - PROCESS | 3746 | RSS: Main: 200552448 01:25:08 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | Cycle 1(1): loaded http://localhost:47976/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47976/tests/kraken/driver.html?testName=ai-astar) 01:25:10 INFO - PROCESS | 3746 | RSS: Main: 262131712 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | __start_tp_report 01:25:10 INFO - PROCESS | 3746 | _x_x_mozilla_page_load 01:25:10 INFO - PROCESS | 3746 | _x_x_mozilla_page_load_details 01:25:10 INFO - PROCESS | 3746 | |i|pagename|runs| 01:25:10 INFO - PROCESS | 3746 | |0;ai-astar;109;111;106;110;112;112;101;111;110;111 01:25:10 INFO - PROCESS | 3746 | |1;audio-beat-detection;157;129;155;174;127;148;161;128;176;126 01:25:10 INFO - PROCESS | 3746 | |2;audio-dft;162;160;159;160;160;160;161;165;162;160 01:25:10 INFO - PROCESS | 3746 | |3;audio-fft;75;72;98;93;73;75;77;126;93;75 01:25:10 INFO - PROCESS | 3746 | |4;audio-oscillator;92;93;149;92;93;93;143;93;93;146 01:25:10 INFO - PROCESS | 3746 | |5;imaging-gaussian-blur;117;116;117;116;117;117;117;117;117;118 01:25:10 INFO - PROCESS | 3746 | |6;imaging-darkroom;144;145;146;146;146;145;146;146;145;145 01:25:10 INFO - PROCESS | 3746 | |7;imaging-desaturate;95;95;96;96;97;95;95;95;95;96 01:25:10 INFO - PROCESS | 3746 | |8;json-parse-financial;57;56;56;56;57;56;56;66;57;54 01:25:10 INFO - PROCESS | 3746 | |9;json-stringify-tinderbox;67;67;68;67;68;68;68;67;68;68 01:25:10 INFO - PROCESS | 3746 | |10;stanford-crypto-aes;80;82;82;82;84;82;82;83;82;83 01:25:10 INFO - PROCESS | 3746 | |11;stanford-crypto-ccm;117;118;122;113;121;119;118;118;118;122 01:25:10 INFO - PROCESS | 3746 | |12;stanford-crypto-pbkdf2;144;140;156;147;159;141;152;144;143;149 01:25:10 INFO - PROCESS | 3746 | |13;stanford-crypto-sha256-iterative;69;68;69;68;68;68;70;70;69;68 01:25:10 INFO - PROCESS | 3746 | __end_tp_report 01:25:10 INFO - PROCESS | 3746 | __start_cc_report 01:25:10 INFO - PROCESS | 3746 | _x_x_mozilla_cycle_collect,1085 01:25:10 INFO - PROCESS | 3746 | __end_cc_report 01:25:10 INFO - PROCESS | 3746 | __startTimestamp1456824310569__endTimestamp 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | ------- Summary: start ------- 01:25:10 INFO - PROCESS | 3746 | Number of tests: 14 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#0] ai-astar Cycles:10 Average:109.30 Median:111.00 stddev:3.40 (3.1%) stddev-sans-first:3.61 01:25:10 INFO - PROCESS | 3746 | Values: 109.0 111.0 106.0 110.0 112.0 112.0 101.0 111.0 110.0 111.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#1] audio-beat-detection Cycles:10 Average:148.10 Median:156.00 stddev:19.56 (12.5%) stddev-sans-first:20.48 01:25:10 INFO - PROCESS | 3746 | Values: 157.0 129.0 155.0 174.0 127.0 148.0 161.0 128.0 176.0 126.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#2] audio-dft Cycles:10 Average:160.90 Median:160.50 stddev:1.73 (1.1%) stddev-sans-first:1.79 01:25:10 INFO - PROCESS | 3746 | Values: 162.0 160.0 159.0 160.0 160.0 160.0 161.0 165.0 162.0 160.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#3] audio-fft Cycles:10 Average:85.70 Median:76.00 stddev:17.16 (22.6%) stddev-sans-first:17.76 01:25:10 INFO - PROCESS | 3746 | Values: 75.0 72.0 98.0 93.0 73.0 75.0 77.0 126.0 93.0 75.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#4] audio-oscillator Cycles:10 Average:108.70 Median:93.00 stddev:25.78 (27.7%) stddev-sans-first:26.63 01:25:10 INFO - PROCESS | 3746 | Values: 92.0 93.0 149.0 92.0 93.0 93.0 143.0 93.0 93.0 146.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#5] imaging-gaussian-blur Cycles:10 Average:116.90 Median:117.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 01:25:10 INFO - PROCESS | 3746 | Values: 117.0 116.0 117.0 116.0 117.0 117.0 117.0 117.0 117.0 118.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#6] imaging-darkroom Cycles:10 Average:145.40 Median:146.00 stddev:0.70 (0.5%) stddev-sans-first:0.53 01:25:10 INFO - PROCESS | 3746 | Values: 144.0 145.0 146.0 146.0 146.0 145.0 146.0 146.0 145.0 145.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#7] imaging-desaturate Cycles:10 Average:95.50 Median:95.50 stddev:0.71 (0.7%) stddev-sans-first:0.73 01:25:10 INFO - PROCESS | 3746 | Values: 95.0 95.0 96.0 96.0 97.0 95.0 95.0 95.0 95.0 96.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#8] json-parse-financial Cycles:10 Average:57.10 Median:56.50 stddev:3.25 (5.7%) stddev-sans-first:3.44 01:25:10 INFO - PROCESS | 3746 | Values: 57.0 56.0 56.0 56.0 57.0 56.0 56.0 66.0 57.0 54.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#9] json-stringify-tinderbox Cycles:10 Average:67.60 Median:68.00 stddev:0.52 (0.8%) stddev-sans-first:0.50 01:25:10 INFO - PROCESS | 3746 | Values: 67.0 67.0 68.0 67.0 68.0 68.0 68.0 67.0 68.0 68.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#10] stanford-crypto-aes Cycles:10 Average:82.20 Median:82.00 stddev:1.03 (1.3%) stddev-sans-first:0.73 01:25:10 INFO - PROCESS | 3746 | Values: 80.0 82.0 82.0 82.0 84.0 82.0 82.0 83.0 82.0 83.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#11] stanford-crypto-ccm Cycles:10 Average:118.60 Median:118.50 stddev:2.67 (2.3%) stddev-sans-first:2.77 01:25:10 INFO - PROCESS | 3746 | Values: 117.0 118.0 122.0 113.0 121.0 119.0 118.0 118.0 118.0 122.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:147.50 Median:148.00 stddev:6.42 (4.3%) stddev-sans-first:6.68 01:25:10 INFO - PROCESS | 3746 | Values: 144.0 140.0 156.0 147.0 159.0 141.0 152.0 144.0 143.0 149.0 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.70 Median:69.00 stddev:0.82 (1.2%) stddev-sans-first:0.87 01:25:10 INFO - PROCESS | 3746 | Values: 69.0 68.0 69.0 68.0 68.0 68.0 70.0 70.0 69.0 68.0 01:25:10 INFO - PROCESS | 3746 | -------- Summary: end -------- 01:25:10 INFO - PROCESS | 3746 | 01:25:10 INFO - PROCESS | 3746 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:25:10 INFO - PROCESS | 3746 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:25:10 INFO - PROCESS | 3746 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:25:10 INFO - PROCESS | 3746 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:25:10 INFO - PROCESS | 3746 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:25:10 INFO - PROCESS | 3746 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:25:10 INFO - PROCESS | 3746 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 01:25:11 INFO - TEST-INFO | 3746: exit 0 01:25:11 INFO - TEST-OK | kraken | took 60011ms 01:25:11 INFO - SUITE-END | took 1174s 01:25:11 INFO - Completed test suite (00:19:34) 01:25:11 INFO - Working with test: dromaeo_css 01:25:11 INFO - Generating results file: dromaeo_css 01:25:11 INFO - Working with test: kraken 01:25:11 INFO - Generating results file: kraken 01:25:11 INFO - javascript benchmark 01:25:11 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:25:11 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,63,35]] 01:25:11 INFO - process_Request line: dromaeo_css 6767.78 graph.html#tests=[[72,63,35]] 01:25:11 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:25:12 INFO - process_Request line: kraken 1512.20 graph.html#tests=[[232,63,35]] 01:25:12 INFO - RETURN: dromaeo_css: 6767.78 01:25:12 INFO - RETURN: kraken: 1512.20 01:25:12 INFO - javascript benchmark 01:25:12 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3107.5494053362277, 3116.1742138333343, 3121.5161649944266, 3150.417172823028, 3187.5856138701974, 4918.901621967559, 4925.679830810995, 4958.727270000153, 4961.950380496199, 5057.49425057494, 4976.203807390818, 5015.874603134915, 5053.242013697947, 5071.873203169914, 5075.822346217883, 4522.90954180917, 4541.205289074399, 4566.520515345891, 4663.393758811367, 4739.691920025204, 4560.954390456086, 4611.723296602215, 4647.093816705744, 4686.695364801277, 4756.191447453941, 4585.037142200142, 4598.308404647154, 4606.585407313341, 4631.8842028949375, 4641.350210970467, 4590.540945905416, 4594.977025114853, 4605.21058099576, 4605.631549476034, 4640.303954406832, 4514.14231296056, 4523.70595911268, 4586.403767510203, 4605.217113090783, 4613.0, 4926.605871530269, 4932.0629080474955, 4946.134426475388, 4946.9010619787405, 4961.231009193581, 5380.569554435675, 5400.945990540084, 5405.8107966221, 5410.675359478405, 5414.214938833887, 5307.097793375096, 5331.840044798662, 5351.357837059539, 5366.141417373202, 5422.349318081855, 5069.9746501267255, 5085.262636917701, 5098.617603679739, 5100.872478188075, 5104.438511763703, 5272.604554658416, 5485.259489968883, 5507.614466987353, 5507.972460137674, 5553.500184983371, 5329.920051199235, 5362.51737343641, 5378.973105134528, 5394.73026348681, 5429.511343978982, 5386.784528618811, 5420.403755586883, 5440.891182176334, 5442.482964118402, 5449.891002179934, 5202.401723801811, 5309.389420216725, 5417.024935511567, 5430.782768689287, 5451.1005684062475, 5242.449542798027, 5251.8161864335325, 5263.078961181778, 5265.157574788015, 5307.336582927134, 4082.1223436961195, 4085.7344272622777, 4092.0588264699286, 4120.938185927213, 4129.772862492592, 3688.870889518854, 3716.1267102230954, 3734.495843061152, 3748.231612519427, 3768.9246215075545, 5011.373578302712, 5021.698698078127, 5034.345535080416, 5035.748212589429, 5064.5441910228255, 5326.2543243945875, 5327.520523152857, 5336.733163341817, 5338.91991620126, 5375.865603359947, 4953.653244272867, 5044.117279476077, 5052.267421223902, 5169.508896654812, 5169.81905633301, 4533.070720502289, 4545.0909818036525, 4563.498015218323, 4586.587207151372, 4605.907881842344, 5494.780208791683, 5566.415526369673, 5568.136938774496, 5579.721013949286, 5586.832395028156, 5302.045631786315, 5317.494837990384, 5351.464853514617, 5391.730413479232, 5408.918866217088, 5551.916721249266, 5553.4724201200825, 5558.24963629921, 5574.554035677055, 5586.664800112007, 5213.895722085461, 5274.446183150714, 5277.947220527745, 5280.960824926563, 5320.388155362028, 5399.541039011728, 5424.403315635198, 5438.374586922555, 5440.374356949002, 5477.315335583052, 5230.8169214077325, 5231.529162375405, 5236.869078272921, 5272.261883336259, 5318.441563635763, 5097.61767867404, 5234.162533994542, 5252.737363131751, 5257.316548848626, 5270.920936186037, 5140.306058682179, 5162.5095615916425, 5164.948350516447, 5169.896602068013, 5229.294045303835, 5166.070107380708, 5242.711650859087, 5248.081585722407, 5263.578913686819, 5297.099493086262, 5125.487451254845, 5167.793288268427, 5178.559822414986, 5207.1668533034535, 5245.396779370421], "unit": "score", "name": "dojo.html", "value": 4967.322470284249}, {"lowerIsBetter": false, "replicates": [523.8114278859613, 536.1073812102848, 551.3136145498854, 555.8715806911968, 560.2184951991972, 28920.1323960281, 36681.26637467252, 37128.44307335392, 37244.255114897685, 37250.25499490012, 40342.0, 40919.59080409195, 40948.0, 41083.38374924379, 41300.380494292534, 8447.704330348439, 8644.740657780276, 8647.567621618893, 8648.610812513452, 8650.307975361957, 8428.452150610221, 8572.485650860937, 8574.614142363609, 8577.785555361104, 8823.0, 8769.123087691243, 8812.911870881273, 8842.557872106401, 8850.645974161025, 8860.379773415863, 8738.213560779528, 8794.42836215644, 8796.42823216492, 8813.779655508599, 8816.294696424271, 8653.264472519844, 8774.166454186841, 8782.912170878273, 8783.78040548985, 8784.956075219647, 41254.174916501805, 41476.1704765906, 41648.79175604103, 41671.7916410416, 41769.79115104435, 3530.1880567469625, 3914.608539146091, 4119.011437255067, 4123.690723195742, 4131.731437456556, 29972.0, 30070.54894176589, 30362.240943976358, 31411.84294078515, 33350.16624584381, 3433.3133373325436, 3463.5670541182353, 3479.251960828434, 3526.5768107827225, 3652.7808331499928, 270175.0, 273829.0, 274444.0, 275258.0, 275589.0, 45647.0, 46554.534454655695, 64123.0, 65573.34426655767, 65697.67151164214, 46751.53248467472, 46871.48463865224, 47048.2942755859, 47090.293645595346, 47120.29319560209, 15695.921520392325, 15929.840701593068, 15939.601509962344, 15942.442014529668, 15951.840481595267, 12725.681857953625, 12820.102592818599, 12826.422810973529, 12835.614931552069, 12836.614901552968, 14665.706685866224, 14940.850591494163, 14952.476663316731, 14974.625634359229, 15084.773728394082, 6018.15745795589, 6059.454649081604, 6075.392460753889, 6084.847878803065, 6191.81424557264, 916.6104405627582, 992.2409356842022, 1012.7468132966758, 1086.3373342261214, 1139.0432037088885, 29168.27079323034, 29207.799787496435, 29281.56077658837, 29474.0, 29480.852595737313, 993.8161440133598, 1029.1663752360612, 1082.86464191976, 1106.070900443615, 1131.0781712903956, 14672.193029383487, 14918.941616968496, 15158.924205378902, 15263.618409539627, 15438.768418473732, 306999.0, 308485.0, 310704.0, 310719.0, 310940.0, 54017.0, 54566.181507277426, 54601.72699136479, 54603.72698136563, 54635.726821366436, 1183.7387996070943, 1261.3945306252867, 1349.9797503037462, 1354.512375544803, 1387.6600232942792, 25632.8718356407, 26491.470170596866, 26656.333591660365, 28709.133906296025, 28793.424131516833, 40978.0, 41046.179076417706, 41266.1746765057, 41266.79366603148, 42490.78754606207, 186918.0, 188880.0, 195319.0, 196637.0, 197018.23854091924, 33258.667413326526, 43668.0, 43898.78050609727, 44362.556374435844, 44970.0, 44387.33418998653, 44878.3268250983, 45157.0, 45665.771671142764, 46006.53993460022, 37156.81421592983, 37267.8136609326, 37421.251574967806, 37740.43389349107, 37865.432018520296, 36415.27169456649, 36545.817270913474, 37287.81356093202, 37612.811935940146, 37941.241175176896, 36056.4591531122, 36074.27851442904, 36686.63313366832, 36833.44749828701, 36885.0, 32167.195820104684, 32397.51403728993, 32470.0, 32990.34019319648, 33035.0, 25241.87379063093, 25432.364190895376, 25452.618210726483, 25519.87240063788, 25684.229473115836], "unit": "score", "name": "ext.html", "value": 18086.984845988023}, {"lowerIsBetter": false, "replicates": [328.73701039168674, 337.8682313897579, 356.27320266656017, 356.8215892053973, 359.78412952228666, 16427.589310267234, 17058.061806600646, 17240.137993100358, 17903.373381931637, 17946.551336216602, 11044.834327485094, 11058.723531911706, 11164.776704465927, 13078.934605326984, 16196.190190490488, 4717.174494463472, 4894.388201474816, 4904.828331008415, 4917.729524876148, 4918.803247870081, 3670.724695647824, 4005.1388951375448, 5859.7656093756195, 5881.764729410818, 5915.5859089863725, 5841.211436456067, 5853.239078919734, 5861.325947516048, 5873.76504939804, 5880.852978675546, 5752.137179423099, 5766.336871259796, 5910.054391297372, 5920.259967504062, 5923.259592550931, 5262.736863156865, 5268.525832675077, 5274.103402421598, 5276.736163191864, 5349.625526213166, 14250.073745206528, 20025.899870500554, 20504.38486845382, 20514.69227961567, 20568.0, 2091.72807535021, 2101.4116047506723, 2172.2025795528207, 2278.5670722562827, 2652.2175958092216, 9084.954575227148, 9180.357374983754, 9312.906870931272, 9322.207612352959, 9531.714048578553, 1747.772789537352, 1843.294952169238, 1859.3678149429259, 1863.319888240796, 1896.3836753055175, 43017.35473967893, 59000.70499647517, 63706.68146659283, 66305.66847165782, 66784.0, 9664.951675241578, 10066.69799906004, 10390.740231494274, 10437.843432348522, 10584.312019718695, 13608.523701670394, 13706.52027179044, 13791.241481718402, 13792.103513271606, 13803.792943105862, 7491.513051651626, 7528.209537998431, 7593.316601505891, 7681.155072941972, 7687.461877668621, 7434.25657434263, 7524.247575242432, 7552.207018263003, 7645.923540764632, 7663.578503182379, 4448.977755111204, 4545.272756358967, 4553.2942393929, 4589.977050114728, 4640.419947506562, 1833.6241070580766, 1836.7704036995376, 1846.6491366640296, 1849.2880241107002, 1892.7634045744283, 926.323783637948, 950.9904900950902, 960.313375936209, 1021.1065317846884, 1053.9262251642313, 14664.633384165269, 15928.0, 16757.664846703, 16944.15279236033, 17290.654186916192, 912.6349460215966, 979.1530326267728, 1001.9348742331871, 1022.9897701022894, 1050.5430137890041, 9192.310576706774, 9619.470929098827, 9659.46872921996, 9718.12536871685, 9871.654492092743, 315068.0, 315831.0, 317907.0, 319536.0, 320013.0, 60298.39701602928, 73378.63310683519, 78454.607726961, 78476.21523784804, 79443.60278198573, 1024.0680980307884, 1037.123630532214, 1057.1173070486077, 1064.3401091323428, 1067.530286673861, 14378.784318235026, 14528.418863245352, 14970.47603333878, 15463.304151313443, 15591.298391572633, 34206.48690269598, 34584.30831383409, 35082.82458587691, 35351.29297414089, 35998.280034399686, 44248.7787561073, 46430.767846160554, 48611.75694121507, 50086.749566251936, 50550.494495054576, 7841.176676448891, 7885.422915416825, 8032.598370081356, 8072.475289106189, 8095.878561821695, 11494.540218391505, 12595.370231488205, 12683.302418367079, 12826.358682065673, 12851.228926264454, 10438.425886576311, 10851.131909447384, 11029.83455248188, 11079.778404431705, 11120.11039116885, 10396.58413663445, 10841.457927103771, 10844.945775271073, 10950.616728414467, 11203.495842686936, 10641.733956651145, 11317.151213658844, 11349.375784331942, 11368.829467558158, 11603.013743831869, 7706.229377062249, 7759.961200194189, 7860.0567931848545, 7915.802104947192, 8060.727814258453, 9154.954225228832, 10837.669900971014, 10971.561137554727, 10976.506057227603, 11239.605376888929], "unit": "score", "name": "jquery.html", "value": 8272.25117971332}, {"lowerIsBetter": false, "replicates": [1360.0003997062163, 1464.7363474574577, 1489.456348432822, 1674.9162541872904, 1839.1264149528968, 7308.561486310825, 7377.963110184448, 7389.298016688413, 7391.926080739191, 7394.075740532434, 7624.695012199505, 7748.651310691032, 7751.224877512246, 7756.806079848006, 7759.1852855450215, 1936.6514027475048, 1988.6619274723332, 2220.8667479951255, 2256.345659758672, 2292.449812045114, 2254.41385239838, 2262.909483620653, 2265.184533567914, 2265.365697604673, 2267.1498188179435, 2207.75714671386, 2231.6429371300596, 2286.017012684545, 2287.405274628592, 2289.6679981402685, 2184.8252139828774, 2194.440417693486, 2201.1305534313856, 2202.2292197730826, 2211.1929145861804, 2232.218723446797, 2258.108047321315, 2283.235116236063, 2293.0254641777346, 2293.495431005176, 7886.487378320391, 7945.165757595427, 7955.0, 7967.641456134488, 7969.043714754266, 4713.693609915379, 4791.496892826238, 4822.204336284509, 4825.034993001414, 4825.348577942003, 3131.8590663419973, 3142.1359126240236, 3171.4291427543035, 3209.326041531281, 3210.678932106794, 1009.2228983682523, 1017.1760873692333, 1027.203916964351, 1032.390889375272, 1059.5708737961138, 10713.678589642323, 10761.30051546647, 10774.40740759258, 10775.892241077567, 10787.892121078845, 4118.588141185857, 4212.957870421318, 4267.658587313008, 4268.509121451011, 4276.5295817460055, 9192.678256260999, 9284.814303713887, 9329.533523323807, 9336.439813611205, 9355.345125841262, 4794.7842347094465, 4795.424549054136, 4808.903821923542, 4810.182269014276, 4811.254255590389, 3826.1199924017633, 4212.515560710496, 4256.787160641956, 4308.138372325485, 4308.2460569400855, 3601.585817631006, 3677.1174918019483, 3688.354537955847, 3722.925541489209, 3764.924701506009, 1146.7247860513417, 1184.988150118505, 1189.1200511621512, 1199.3283761093815, 1207.3118322556234, 1349.5006847466304, 1364.270115488209, 1369.1306020676743, 1377.9104358216885, 1388.6528367908022, 7522.511036782592, 7633.694652213961, 7640.579768112807, 7652.196519365498, 7654.4259180561685, 464.85589467265254, 465.4554171619214, 466.571495366616, 467.90174063447057, 476.43304467683345, 5665.178549110438, 5734.885302293931, 5743.913841292384, 5755.136729490526, 5792.82621521355, 9020.368574199743, 9074.727758167266, 9115.680951166678, 9226.49254291007, 9235.722928312161, 9046.366754327266, 9124.270058395312, 9177.174054335143, 9196.08039196075, 9197.264218862609, 7499.9500069990245, 7510.248975102555, 7619.314261716361, 7647.502912310682, 7723.34351580122, 7397.066322110327, 7452.217517160837, 7475.514091584029, 7476.102867655916, 7484.0270764800225, 8475.74572762818, 8548.871766923377, 8576.571171441528, 8765.254953328784, 8765.517896515752, 8569.528675922884, 8838.734837954871, 8941.776455588662, 8999.10008999121, 9006.099390060941, 6185.597936134137, 6525.8694826104165, 6655.534112612264, 7064.540804847668, 7166.498345115792, 7459.776206713807, 7493.400527957641, 7499.325060744559, 7502.587357695379, 7512.737054203077, 6620.768273110611, 6720.663966801738, 6788.321167883172, 6855.143107111611, 6972.372486476039, 6713.362230588086, 6747.898781518379, 6786.660666966731, 6907.34380233877, 6935.063766391674, 7076.115485564304, 7122.5726456412785, 7146.464015198777, 7163.140423149255, 7181.784546463615, 6535.836604084936, 6556.8360790980605, 6617.569857959217, 6620.470362370903, 6623.138991931018, 6519.869602608016, 6656.567323123982, 6658.43403310724, 6661.367170118831, 6684.565503242274], "unit": "score", "name": "mootools.html", "value": 4416.941940212739}, {"lowerIsBetter": false, "replicates": [313.56727715752265, 317.2386272944933, 321.8117401320227, 333.6513343555985, 336.4952571143285, 5721.856953576157, 5801.854953626162, 5838.4453476919625, 5868.325142608602, 5885.823425297237, 5748.425157484249, 5751.223584816049, 5758.942410575893, 5759.424057594239, 5759.884802303952, 4251.447311849463, 4360.062586543892, 4420.46954365475, 4446.421965144526, 4455.353973673816, 4456.955430445702, 4479.977600111994, 4487.730736155825, 4496.910061798762, 4501.932471012938, 4231.957680423203, 4450.221211288028, 4454.198244316021, 4460.197164510387, 4460.4647442306805, 4340.283853164224, 4435.4899186593475, 4445.466544014706, 4447.288433850568, 4453.732776033448, 3912.765234085964, 3923.9607603923882, 3925.1168487090463, 3930.997595613129, 3931.4692516510477, 5553.805616803393, 5554.472325129106, 5554.694491802949, 5559.471850174227, 5560.082586373243, 5184.870378240536, 5188.403333616645, 5189.325387699612, 5190.221466779975, 5194.27280180775, 6142.385761423867, 6144.938550614482, 6153.323134455206, 6157.876842463125, 6211.565190436671, 4100.077482566428, 4224.2185195738575, 4246.40550322955, 4272.188284226018, 4368.737875727435, 6331.430171284561, 6369.394907483782, 6384.585001974857, 6396.136521569575, 6398.5521013528605, 4315.0722594641675, 4316.223079845658, 4316.676249281317, 4318.0, 4319.956800431955, 4359.062801497693, 4367.27939889921, 4368.148211098869, 4369.43197384338, 4375.956240437555, 5082.0, 5089.211172268304, 5090.643654944119, 5092.898142037138, 5093.414257360451, 6018.398160183947, 6121.143039974407, 6173.81478555644, 6176.197094377702, 6183.134361189437, 1524.7789070584704, 1534.7621118726615, 1541.6993686231078, 1542.8302886682457, 1544.0967034284845, 945.8013817098487, 986.2701600815345, 1003.9297249192632, 1010.6917390195914, 1041.8124737547162, 5836.124581312837, 5840.065589505659, 5893.528517718572, 5963.0, 5969.492593129546, 6293.685315734195, 6295.276043254993, 6306.810795676137, 6335.144755458046, 6372.458341041063, 5943.762249509971, 5948.0, 5948.10778383246, 5949.0, 5954.851128721816, 3358.0, 3395.049386171876, 3397.235621985083, 3397.4224381855142, 3398.4052790761516, 6493.480521558264, 6586.934130658728, 6612.636305003175, 6757.797266082025, 6764.154480689914, 6472.482201423874, 6483.254425741005, 6524.412802847766, 6533.346665333429, 6538.084668146464, 6750.594964302158, 6754.966225168842, 6759.932400676029, 6761.154855643044, 6764.188297404343, 6381.234251889618, 6391.680415979089, 6394.6482943436695, 6397.520185985976, 6399.456046236122, 5723.513501352431, 5991.820245392645, 6330.683465826783, 6345.746170153142, 6347.777827776005, 6503.674816259263, 6610.735570577123, 6740.561863478858, 6752.426043786137, 6760.053592496956, 4316.136772645421, 4364.039911219526, 4364.388985541963, 4364.519902810752, 4365.476142862877, 6404.615723056631, 6405.93594064072, 6408.935910640834, 6409.423151916163, 6411.487081033413, 6211.720472578654, 6213.813585592439, 6222.191115155001, 6224.657643829632, 6225.750969961332, 5949.434803693643, 6031.60794548353, 6193.84515387119, 6207.286162091417, 6217.658028808278, 5950.166976623363, 6011.128386383863, 6022.0, 6030.6080104793045, 6033.487153591994, 6231.034189700604, 6245.500359971101, 6248.0, 6252.187215661935, 6254.687265636609, 6088.208532890696, 6099.75600975956, 6102.206713127265, 6116.602420842631, 6117.143599895929], "unit": "score", "name": "prototype.html", "value": 4641.807645969258}, {"lowerIsBetter": false, "replicates": [714.2857142857143, 748.5695724958149, 751.9435193553056, 785.9685612575497, 827.9420440569161, 13869.167849929, 13972.37124329405, 14040.64898377541, 14068.929655351722, 14085.154890706564, 13384.866151338483, 13515.864841351584, 13593.456261749543, 13610.863891361083, 13671.863281367183, 683.0198664915837, 807.4953154278576, 809.4050872608614, 823.8105235795771, 830.6926437218237, 831.2311112221171, 833.2625626320689, 834.7662654456761, 835.1773503099442, 835.2232423845821, 869.6347534035721, 869.9043105258417, 871.4030888841132, 872.1235158665532, 872.6640243506232, 704.4082970304943, 712.4371746320375, 844.8563744163507, 861.0829466618031, 866.51908190954, 628.1802248066272, 629.8425393651587, 630.9842253943642, 632.4276529740592, 632.6330728177646, 13871.306434678225, 13887.375068121959, 13890.166590004632, 13901.165930044128, 13904.235267060307, 12849.550265740654, 13038.153744645353, 13271.601851944457, 13332.06675532713, 13617.727645447036, 9988.200943924468, 10064.345817521838, 10716.517756700967, 10864.076553492963, 11021.614243501519, 3591.3715099857423, 3606.459031145323, 3643.3441980443777, 3658.34149853029, 3779.225258821935, 48348.03303933937, 48404.51595484035, 48435.757821211024, 48497.27254091156, 48546.514534854556, 10006.949965250127, 10186.388816671024, 10193.592256309812, 10263.2302577307, 10620.628278010232, 18689.25242990265, 18720.0, 18732.969686667093, 18779.624407512045, 18819.247230110916, 7535.472516923873, 7585.431092667962, 7626.580538070349, 7674.501157424861, 7679.731209407756, 4206.516250631155, 4384.364267181241, 4446.0, 4447.62195213404, 4449.7330160190495, 3032.378362435695, 3033.9696603034126, 3036.2864726789185, 3072.4776787946103, 3098.2873938994157, 532.5686194182724, 549.4011527435115, 550.3835704011452, 552.2434265056897, 552.5551930695829, 645.6223109481007, 663.6681659170415, 667.5260564998905, 683.2143035509105, 713.1513498936353, 8001.4398992071165, 8237.958810205912, 8447.281981031558, 8497.490150590984, 8522.446041007315, 665.7569986954824, 669.0900375489331, 680.5066326913047, 686.27255109584, 705.3334598804183, 3906.257811015898, 3962.187751510933, 4010.6590939769862, 4055.1686904185162, 4089.995862144615, 60979.08531372033, 61141.38858611357, 62159.0, 62207.6889615549, 62250.0, 51931.44205673836, 52672.0, 53061.30611061375, 53359.0, 53724.99999999922, 48130.75934620375, 48317.5168248313, 48704.0, 48704.512954870705, 48804.26793598099, 8072.798180045545, 8203.83592328162, 8233.22985558084, 8322.875156872531, 8328.208820162075, 36550.26899462049, 36584.634153658124, 37373.4393984085, 37566.812165938994, 37654.43518347172, 42799.0, 43910.0, 46190.76904615456, 46519.0, 47031.05937881292, 10438.947805260925, 10605.204609654153, 10676.383013625187, 10967.177461690564, 11039.172062095215, 10155.39067655943, 10307.226957978031, 10515.815619108518, 11012.724681882697, 11066.557337706723, 10547.208959328234, 10883.727906802076, 10913.399763012792, 10944.452777361259, 11241.66275011751, 10293.691189264335, 10366.429846358522, 10601.25791194609, 10673.46632668379, 10974.725631859268, 10456.26806123564, 10582.4708764563, 10787.0, 10830.891691082988, 11123.666290011313, 9391.0, 9432.905670943202, 9456.574454149442, 9589.712308630753, 9629.614815407305, 8148.185181482041, 8449.281811045885, 8726.30189584819, 8984.550772461482, 9151.77120571991], "unit": "score", "name": "yui.html", "value": 6305.479680351937}], "name": "dromaeo_css", "value": 6767.783830133774}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [109.0, 111.0, 106.0, 110.0, 112.0, 112.0, 101.0, 111.0, 110.0, 111.0], "unit": "score", "name": "ai-astar", "value": 109.3}, {"lowerIsBetter": true, "replicates": [157.0, 129.0, 155.0, 174.0, 127.0, 148.0, 161.0, 128.0, 176.0, 126.0], "unit": "score", "name": "audio-beat-detection", "value": 148.1}, {"lowerIsBetter": true, "replicates": [162.0, 160.0, 159.0, 160.0, 160.0, 160.0, 161.0, 165.0, 162.0, 160.0], "unit": "score", "name": "audio-dft", "value": 160.9}, {"lowerIsBetter": true, "replicates": [75.0, 72.0, 98.0, 93.0, 73.0, 75.0, 77.0, 126.0, 93.0, 75.0], "unit": "score", "name": "audio-fft", "value": 85.7}, {"lowerIsBetter": true, "replicates": [92.0, 93.0, 149.0, 92.0, 93.0, 93.0, 143.0, 93.0, 93.0, 146.0], "unit": "score", "name": "audio-oscillator", "value": 108.7}, {"lowerIsBetter": true, "replicates": [117.0, 116.0, 117.0, 116.0, 117.0, 117.0, 117.0, 117.0, 117.0, 118.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.9}, {"lowerIsBetter": true, "replicates": [144.0, 145.0, 146.0, 146.0, 146.0, 145.0, 146.0, 146.0, 145.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.4}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 96.0, 96.0, 97.0, 95.0, 95.0, 95.0, 95.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.5}, {"lowerIsBetter": true, "replicates": [57.0, 56.0, 56.0, 56.0, 57.0, 56.0, 56.0, 66.0, 57.0, 54.0], "unit": "score", "name": "json-parse-financial", "value": 57.1}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 68.0, 67.0, 68.0, 68.0, 68.0, 67.0, 68.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.6}, {"lowerIsBetter": true, "replicates": [80.0, 82.0, 82.0, 82.0, 84.0, 82.0, 82.0, 83.0, 82.0, 83.0], "unit": "score", "name": "stanford-crypto-aes", "value": 82.2}, {"lowerIsBetter": true, "replicates": [117.0, 118.0, 122.0, 113.0, 121.0, 119.0, 118.0, 118.0, 118.0, 122.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 118.6}, {"lowerIsBetter": true, "replicates": [144.0, 140.0, 156.0, 147.0, 159.0, 141.0, 152.0, 144.0, 143.0, 149.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 147.5}, {"lowerIsBetter": true, "replicates": [69.0, 68.0, 69.0, 68.0, 68.0, 68.0, 70.0, 70.0, 69.0, 68.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 68.7}], "name": "kraken", "value": 1512.1999999999998}]} 01:25:12 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,63,35]]", "result": "1512.20"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,63,35]]", "result": "6767.78"}}} 01:25:12 INFO - Return code: 0 01:25:12 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 01:25:12 INFO - # TBPL SUCCESS # 01:25:12 INFO - Running post-action listener: _resource_record_post_action 01:25:12 INFO - Running post-run listener: _resource_record_post_run 01:25:13 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 10330112; Write bytes: 440918016; Read time: 2084; Write time: 477912 01:25:13 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 4096; Write bytes: 154468352; Read time: 296; Write time: 185772 01:25:13 INFO - run-tests - Wall time: 1177s; CPU: 13.0%; Read bytes: 8589312; Write bytes: 286449664; Read time: 1756; Write time: 292140 01:25:13 INFO - Running post-run listener: _upload_blobber_files 01:25:13 INFO - Blob upload gear active. 01:25:13 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 01:25:13 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 01:25:13 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', 'Mozilla-Inbound', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 01:25:13 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 Mozilla-Inbound -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 01:25:13 INFO - (blobuploader) - INFO - Open directory for files ... 01:25:13 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 01:25:13 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 01:25:13 INFO - (blobuploader) - INFO - Uploading, attempt #1. 01:25:14 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 01:25:14 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 01:25:14 INFO - (blobuploader) - INFO - Done attempting. 01:25:14 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 01:25:14 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 01:25:14 INFO - (blobuploader) - INFO - Uploading, attempt #1. 01:25:15 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 01:25:15 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 01:25:15 INFO - (blobuploader) - INFO - Done attempting. 01:25:15 INFO - (blobuploader) - INFO - Iteration through files over. 01:25:15 INFO - Return code: 0 01:25:15 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 01:25:15 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 01:25:15 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/d3cfc479bbf89cc4c2b1996df9861a5576db0df578041d22a3fbe484abae449bd0f170bc51a62fb578a1372f8da93b2cc5a63fcb12016a095e067cd60b6c634e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/47b1ca426afc442bf639cd061db5a0d4618b253ecbc9c6f425673dffd2989ef7f8781f567327b143b5c738dfcc4cafa9582be23ac0fa515a89c98780a4bd4826"} 01:25:15 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 01:25:15 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 01:25:15 INFO - Contents: 01:25:15 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/d3cfc479bbf89cc4c2b1996df9861a5576db0df578041d22a3fbe484abae449bd0f170bc51a62fb578a1372f8da93b2cc5a63fcb12016a095e067cd60b6c634e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/47b1ca426afc442bf639cd061db5a0d4618b253ecbc9c6f425673dffd2989ef7f8781f567327b143b5c738dfcc4cafa9582be23ac0fa515a89c98780a4bd4826"} 01:25:15 INFO - Running post-run listener: copy_logs_to_upload_dir 01:25:15 INFO - Copying logs to upload dir... 01:25:15 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 01:25:15 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1238.456573 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-03-01 01:25:15.221388) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-01 01:25:15.224706) ========= 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=836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/d3cfc479bbf89cc4c2b1996df9861a5576db0df578041d22a3fbe484abae449bd0f170bc51a62fb578a1372f8da93b2cc5a63fcb12016a095e067cd60b6c634e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/47b1ca426afc442bf639cd061db5a0d4618b253ecbc9c6f425673dffd2989ef7f8781f567327b143b5c738dfcc4cafa9582be23ac0fa515a89c98780a4bd4826"} build_url:https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011209 build_url: 'https://queue.taskcluster.net/v1/task/WKVsjys-Sh2hwNZRz2fChw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/d3cfc479bbf89cc4c2b1996df9861a5576db0df578041d22a3fbe484abae449bd0f170bc51a62fb578a1372f8da93b2cc5a63fcb12016a095e067cd60b6c634e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/47b1ca426afc442bf639cd061db5a0d4618b253ecbc9c6f425673dffd2989ef7f8781f567327b143b5c738dfcc4cafa9582be23ac0fa515a89c98780a4bd4826"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-01 01:25:15.249186) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-01 01:25:15.249556) ========= 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=836cfdc75598d54cb747368e000001a9-1456819536.409660-2078240553 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004471 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-01 01:25:15.301573) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-01 01:25:15.301877) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-01 01:25:15.302168) ========= ========= Total master_lag: 0.25 =========