builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-046 starttime: 1453690055.47 results: success (0) buildid: 20160124163006 builduid: 60cdf350e9754d58827e549647ce89ae revision: 4ea6060b39285038ae811da6b5b343393dc69d90 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:35.473319) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:35.474434) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:35.475079) ========= 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=652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006361 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:35.502517) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:35.503125) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:35.518229) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:35.518746) ========= 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=652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004642 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:35.569259) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:35.569636) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:35.570027) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:35.570394) ========= 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=652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-24 18:47:35-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 84.1M=0s 2016-01-24 18:47:36 (84.1 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.473628 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:36.058855) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:36.059319) ========= 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=652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019428 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:36.111713) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:36.112488) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 4ea6060b39285038ae811da6b5b343393dc69d90 --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 4ea6060b39285038ae811da6b5b343393dc69d90 --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=652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-24 18:47:36,260 truncating revision to first 12 chars 2016-01-24 18:47:36,261 Setting DEBUG logging. 2016-01-24 18:47:36,261 attempt 1/10 2016-01-24 18:47:36,261 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/4ea6060b3928?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-24 18:47:36,528 unpacking tar archive at: mozilla-inbound-4ea6060b3928/testing/mozharness/ program finished with exit code 0 elapsedTime=0.539386 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:36.668801) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:36.669227) ========= echo 4ea6060b39285038ae811da6b5b343393dc69d90 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'4ea6060b39285038ae811da6b5b343393dc69d90'] 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=652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 4ea6060b39285038ae811da6b5b343393dc69d90 program finished with exit code 0 elapsedTime=0.004459 script_repo_revision: '4ea6060b39285038ae811da6b5b343393dc69d90' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:36.721650) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:36.721983) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-24 18:47:36.732496) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2016-01-24 18:47:36.733140) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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=652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 18:47:36 INFO - MultiFileLogger online at 20160124 18:47:36 in /builds/slave/test-pgo 18:47:36 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 18:47:36 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 18:47:36 INFO - {'append_to_log': False, 18:47:36 INFO - 'base_work_dir': '/builds/slave/test-pgo', 18:47:36 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 18:47:36 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 18:47:36 INFO - 'branch': 'Mozilla-Inbound', 18:47:36 INFO - 'buildbot_json_path': 'buildprops.json', 18:47:36 INFO - 'config_files': ('talos/linux_config.py',), 18:47:36 INFO - 'default_actions': ('clobber', 18:47:36 INFO - 'read-buildbot-config', 18:47:36 INFO - 'download-and-extract', 18:47:36 INFO - 'populate-webroot', 18:47:36 INFO - 'create-virtualenv', 18:47:36 INFO - 'install', 18:47:36 INFO - 'run-tests'), 18:47:36 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 18:47:36 INFO - 'download_minidump_stackwalk': True, 18:47:36 INFO - 'download_symbols': 'ondemand', 18:47:36 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 18:47:36 INFO - 'tooltool.py': '/tools/tooltool.py', 18:47:36 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 18:47:36 INFO - '/tools/misc-python/virtualenv.py')}, 18:47:36 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 18:47:36 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 18:47:36 INFO - 'installer_path': 'installer.exe', 18:47:36 INFO - 'log_level': 'info', 18:47:36 INFO - 'log_name': 'talos', 18:47:36 INFO - 'log_to_console': True, 18:47:36 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 18:47:36 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 18:47:36 INFO - 'opt_config_files': (), 18:47:36 INFO - 'pip_index': False, 18:47:36 INFO - 'sps_profile': False, 18:47:36 INFO - 'sps_profile_interval': 0, 18:47:36 INFO - 'suite': 'dromaeojs-e10s', 18:47:36 INFO - 'system_bits': '32', 18:47:36 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 18:47:36 INFO - 'title': 'talos-linux64-ix-046', 18:47:36 INFO - 'tooltool_cache': '/builds/tooltool_cache', 18:47:36 INFO - 'use_talos_json': True, 18:47:36 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 18:47:36 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 18:47:36 INFO - 'work_dir': 'build'} 18:47:36 INFO - ##### 18:47:36 INFO - ##### Running clobber step. 18:47:36 INFO - ##### 18:47:36 INFO - Running pre-action listener: _resource_record_pre_action 18:47:36 INFO - Running main action method: clobber 18:47:36 INFO - rmtree: /builds/slave/test-pgo/build 18:47:36 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 18:47:37 INFO - Running post-action listener: _resource_record_post_action 18:47:37 INFO - ##### 18:47:37 INFO - ##### Running read-buildbot-config step. 18:47:37 INFO - ##### 18:47:37 INFO - Running pre-action listener: _resource_record_pre_action 18:47:37 INFO - Running main action method: read_buildbot_config 18:47:37 INFO - Using buildbot properties: 18:47:37 INFO - { 18:47:37 INFO - "project": "", 18:47:37 INFO - "product": "firefox", 18:47:37 INFO - "script_repo_revision": "production", 18:47:37 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs-e10s", 18:47:37 INFO - "repository": "", 18:47:37 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs-e10s", 18:47:37 INFO - "buildid": "20160124163006", 18:47:37 INFO - "pgo_build": "True", 18:47:37 INFO - "basedir": "/builds/slave/test-pgo", 18:47:37 INFO - "buildnumber": 343, 18:47:37 INFO - "slavename": "talos-linux64-ix-046", 18:47:37 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 18:47:37 INFO - "platform": "ubuntu64_hw", 18:47:37 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos", 18:47:37 INFO - "branch": "mozilla-inbound", 18:47:37 INFO - "repo_path": "integration/mozilla-inbound", 18:47:37 INFO - "revision": "4ea6060b39285038ae811da6b5b343393dc69d90", 18:47:37 INFO - "stage_platform": "linux64-pgo", 18:47:37 INFO - "builduid": "60cdf350e9754d58827e549647ce89ae", 18:47:37 INFO - "slavebuilddir": "test" 18:47:37 INFO - } 18:47:37 INFO - Found installer url https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 18:47:37 INFO - Running post-action listener: _resource_record_post_action 18:47:37 INFO - ##### 18:47:37 INFO - ##### Running download-and-extract step. 18:47:37 INFO - ##### 18:47:37 INFO - Running pre-action listener: _resource_record_pre_action 18:47:37 INFO - Running main action method: download_and_extract 18:47:37 INFO - mkdir: /builds/slave/test-pgo/build/tests 18:47:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:47:37 INFO - https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 18:47:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/test_packages.json 18:47:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/test_packages.json 18:47:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 18:47:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 18:47:40 INFO - Downloaded 1448 bytes. 18:47:40 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 18:47:40 INFO - Using the following test package requirements: 18:47:40 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 18:47:40 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:47:40 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 18:47:40 INFO - u'gtest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:47:40 INFO - u'firefox-46.0a1.en-US.linux-x86_64.gtest.tests.zip'], 18:47:40 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:47:40 INFO - u'jsshell-linux-x86_64.zip'], 18:47:40 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:47:40 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 18:47:40 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 18:47:40 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:47:40 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 18:47:40 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:47:40 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 18:47:40 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:47:40 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 18:47:40 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 18:47:40 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:47:40 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 18:47:40 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 18:47:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:47:40 INFO - https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:47:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 18:47:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 18:47:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 18:47:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:47:43 INFO - Downloaded 22492034 bytes. 18:47:43 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 18:47:43 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 18:47:44 INFO - Return code: 0 18:47:44 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 18:47:44 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')]} 18:47:44 INFO - https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:47:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 18:47:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 18:47:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 18:47:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:47:46 INFO - Downloaded 22492034 bytes. 18:47:46 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 18:47:46 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 18:47:47 INFO - Return code: 0 18:47:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:47:47 INFO - https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 18:47:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 18:47:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 18:47:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 18:47:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 18:47:48 INFO - Downloaded 10706572 bytes. 18:47:48 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 18:47:48 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 18:47:49 INFO - Return code: 0 18:47:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:47:49 INFO - https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 18:47:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 18:47:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 18:47:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 18:47:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 18:47:50 INFO - Downloaded 55982263 bytes. 18:47:50 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 18:47:50 INFO - mkdir: /builds/slave/test-pgo/properties 18:47:50 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 18:47:50 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 18:47:50 INFO - Contents: 18:47:50 INFO - build_url:https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 18:47:50 INFO - Running post-action listener: _resource_record_post_action 18:47:50 INFO - Running post-action listener: set_extra_try_arguments 18:47:50 INFO - ##### 18:47:50 INFO - ##### Running populate-webroot step. 18:47:50 INFO - ##### 18:47:50 INFO - Running pre-action listener: _resource_record_pre_action 18:47:50 INFO - Running main action method: populate_webroot 18:47:50 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 18:47:50 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 18:47:50 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 18:47:50 INFO - '--tppagecycles', 18:47:50 INFO - '7'], 18:47:50 INFO - 'tests': ['tsvgm']}}, 18:47:50 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 18:47:50 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 18:47:50 INFO - 'tests': ['tresize', 'tcanvasmark']}, 18:47:50 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 18:47:50 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 18:47:50 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 18:47:50 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:47:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:47:50 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:47:50 INFO - 'talos_options': ['--e10s'], 18:47:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:47:50 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:47:50 INFO - 'tests': ['damp', 'tps']}, 18:47:50 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:47:50 INFO - 'talos_options': ['--e10s'], 18:47:50 INFO - 'tests': ['damp', 'tps']}, 18:47:50 INFO - 'g3': {'tests': ['dromaeo_dom']}, 18:47:50 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 18:47:50 INFO - 'other': {'tests': ['a11yr', 18:47:50 INFO - 'ts_paint', 18:47:50 INFO - 'tpaint', 18:47:50 INFO - 'sessionrestore', 18:47:50 INFO - 'sessionrestore_no_auto_restore']}, 18:47:50 INFO - 'other-e10s': {'talos_options': ['--e10s'], 18:47:50 INFO - 'tests': ['a11yr', 18:47:50 INFO - 'ts_paint', 18:47:50 INFO - 'tpaint', 18:47:50 INFO - 'sessionrestore', 18:47:50 INFO - 'sessionrestore_no_auto_restore']}, 18:47:50 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 18:47:50 INFO - 'tests': ['a11yr', 18:47:50 INFO - 'ts_paint', 18:47:50 INFO - 'tpaint', 18:47:50 INFO - 'sessionrestore', 18:47:50 INFO - 'sessionrestore_no_auto_restore']}, 18:47:50 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 18:47:50 INFO - 'tests': ['a11yr', 18:47:50 INFO - 'ts_paint', 18:47:50 INFO - 'tpaint', 18:47:50 INFO - 'sessionrestore', 18:47:50 INFO - 'sessionrestore_no_auto_restore']}, 18:47:50 INFO - 'other_l64': {'tests': ['a11yr', 18:47:50 INFO - 'ts_paint', 18:47:50 INFO - 'tpaint', 18:47:50 INFO - 'sessionrestore', 18:47:50 INFO - 'sessionrestore_no_auto_restore']}, 18:47:50 INFO - 'other_nol64': {'tests': ['a11yr', 18:47:50 INFO - 'ts_paint', 18:47:50 INFO - 'tpaint', 18:47:50 INFO - 'sessionrestore', 18:47:50 INFO - 'sessionrestore_no_auto_restore']}, 18:47:50 INFO - 'svgr': {'tests': ['tsvgx', 18:47:50 INFO - 'tsvgr_opacity', 18:47:50 INFO - 'tart', 18:47:50 INFO - 'tscrollx', 18:47:50 INFO - 'cart']}, 18:47:50 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 18:47:50 INFO - 'tests': ['tsvgx', 18:47:50 INFO - 'tsvgr_opacity', 18:47:50 INFO - 'tart', 18:47:50 INFO - 'tscrollx', 18:47:50 INFO - 'cart']}, 18:47:50 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:47:50 INFO - 'tests': ['tp5o']}, 18:47:50 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:47:50 INFO - 'talos_options': ['--e10s'], 18:47:50 INFO - 'tests': ['tp5o']}, 18:47:50 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:47:50 INFO - 'talos_options': ['--xperf_path', 18:47:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:47:50 INFO - 'tests': ['tp5n']}, 18:47:50 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:47:50 INFO - 'talos_options': ['--e10s', 18:47:50 INFO - '--xperf_path', 18:47:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:47:50 INFO - 'tests': ['tp5n']}}, 18:47:50 INFO - 'talos.zip': {'path': '', 18:47:50 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 18:47:50 INFO - Running post-action listener: _resource_record_post_action 18:47:50 INFO - ##### 18:47:50 INFO - ##### Running create-virtualenv step. 18:47:50 INFO - ##### 18:47:50 INFO - Running pre-action listener: _resource_record_pre_action 18:47:50 INFO - Running main action method: create_virtualenv 18:47:50 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 18:47:50 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 18:47:50 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 18:47:50 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 18:47:50 INFO - Using real prefix '/usr' 18:47:50 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 18:47:51 INFO - Installing distribute.............................................................................................................................................................................................done. 18:47:53 INFO - Installing pip.................done. 18:47:53 INFO - Return code: 0 18:47:53 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 18:47:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:47:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:47:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:47:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:47:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:47:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:47:53 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 0x7f68f4cd0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16178a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16e6230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17787f0>, '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 0x16e42d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16e4760>, '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': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', '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 18:47:53 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 18:47:53 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 18:47:53 INFO - Using env: {'DISPLAY': ':0', 18:47:53 INFO - 'HOME': '/home/cltbld', 18:47:53 INFO - 'LANG': 'en_US.UTF-8', 18:47:53 INFO - 'LANGUAGE': 'en_US:en', 18:47:53 INFO - 'LOGNAME': 'cltbld', 18:47:53 INFO - 'MAIL': '/var/mail/cltbld', 18:47:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:47:53 INFO - 'MOZ_NO_REMOTE': '1', 18:47:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:47:53 INFO - 'NO_EM_RESTART': '1', 18:47:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:47:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:47:53 INFO - 'PWD': '/builds/slave/test-pgo', 18:47:53 INFO - 'SHELL': '/bin/bash', 18:47:53 INFO - 'SHLVL': '1', 18:47:53 INFO - 'TERM': 'linux', 18:47:53 INFO - 'TMOUT': '86400', 18:47:53 INFO - 'USER': 'cltbld', 18:47:53 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', 18:47:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:47:53 INFO - '_': '/tools/buildbot/bin/python'} 18:47:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:47:53 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 18:47:53 INFO - Cleaning up... 18:47:53 INFO - Return code: 0 18:47:53 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 18:47:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:47:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:47:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:47:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:47:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:47:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:47:53 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 0x7f68f4cd0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16178a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16e6230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17787f0>, '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 0x16e42d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16e4760>, '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': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', '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 18:47:53 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 18:47:53 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 18:47:53 INFO - Using env: {'DISPLAY': ':0', 18:47:53 INFO - 'HOME': '/home/cltbld', 18:47:53 INFO - 'LANG': 'en_US.UTF-8', 18:47:53 INFO - 'LANGUAGE': 'en_US:en', 18:47:53 INFO - 'LOGNAME': 'cltbld', 18:47:53 INFO - 'MAIL': '/var/mail/cltbld', 18:47:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:47:53 INFO - 'MOZ_NO_REMOTE': '1', 18:47:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:47:53 INFO - 'NO_EM_RESTART': '1', 18:47:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:47:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:47:53 INFO - 'PWD': '/builds/slave/test-pgo', 18:47:53 INFO - 'SHELL': '/bin/bash', 18:47:53 INFO - 'SHLVL': '1', 18:47:53 INFO - 'TERM': 'linux', 18:47:53 INFO - 'TMOUT': '86400', 18:47:53 INFO - 'USER': 'cltbld', 18:47:53 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', 18:47:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:47:53 INFO - '_': '/tools/buildbot/bin/python'} 18:47:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:47:53 INFO - Downloading/unpacking psutil>=0.7.1 18:47:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:47:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:47:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:47:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:47:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:47:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:47:55 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 18:47:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:47:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:47:55 INFO - Installing collected packages: psutil 18:47:55 INFO - Running setup.py install for psutil 18:47:55 INFO - building 'psutil._psutil_linux' extension 18:47:55 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 18:47:55 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 18:47:55 INFO - building 'psutil._psutil_posix' extension 18:47:55 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 18:47:55 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 18:47:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:47:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:47:55 INFO - Successfully installed psutil 18:47:55 INFO - Cleaning up... 18:47:55 INFO - Return code: 0 18:47:55 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 18:47: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')]} 18:47:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:47:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:47: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')]} 18:47:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:47:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:47: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', '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 0x7f68f4cd0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16178a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16e6230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17787f0>, '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 0x16e42d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16e4760>, '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': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', '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 18:47: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', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 18:47: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 mozsystemmonitor==0.0.0 18:47:55 INFO - Using env: {'DISPLAY': ':0', 18:47:55 INFO - 'HOME': '/home/cltbld', 18:47:55 INFO - 'LANG': 'en_US.UTF-8', 18:47:55 INFO - 'LANGUAGE': 'en_US:en', 18:47:55 INFO - 'LOGNAME': 'cltbld', 18:47:55 INFO - 'MAIL': '/var/mail/cltbld', 18:47:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:47:55 INFO - 'MOZ_NO_REMOTE': '1', 18:47:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:47:55 INFO - 'NO_EM_RESTART': '1', 18:47:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:47:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:47:55 INFO - 'PWD': '/builds/slave/test-pgo', 18:47:55 INFO - 'SHELL': '/bin/bash', 18:47:55 INFO - 'SHLVL': '1', 18:47:55 INFO - 'TERM': 'linux', 18:47:55 INFO - 'TMOUT': '86400', 18:47:55 INFO - 'USER': 'cltbld', 18:47:55 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', 18:47:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:47:55 INFO - '_': '/tools/buildbot/bin/python'} 18:47:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:47:56 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 18:47: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 18:47: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 18:47: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 18:47: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 18:47: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 18:47: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 18:47:57 INFO - Downloading mozsystemmonitor-0.0.tar.gz 18:47:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 18:47:57 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 18:47:57 INFO - Installing collected packages: mozsystemmonitor 18:47:57 INFO - Running setup.py install for mozsystemmonitor 18:47:58 INFO - Successfully installed mozsystemmonitor 18:47:58 INFO - Cleaning up... 18:47:58 INFO - Return code: 0 18:47:58 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 18:47:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:47:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:47:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:47:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:47:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:47:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:47:58 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 0x7f68f4cd0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16178a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16e6230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17787f0>, '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 0x16e42d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16e4760>, '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': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', '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 18:47:58 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 18:47:58 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 18:47:58 INFO - Using env: {'DISPLAY': ':0', 18:47:58 INFO - 'HOME': '/home/cltbld', 18:47:58 INFO - 'LANG': 'en_US.UTF-8', 18:47:58 INFO - 'LANGUAGE': 'en_US:en', 18:47:58 INFO - 'LOGNAME': 'cltbld', 18:47:58 INFO - 'MAIL': '/var/mail/cltbld', 18:47:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:47:58 INFO - 'MOZ_NO_REMOTE': '1', 18:47:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:47:58 INFO - 'NO_EM_RESTART': '1', 18:47:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:47:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:47:58 INFO - 'PWD': '/builds/slave/test-pgo', 18:47:58 INFO - 'SHELL': '/bin/bash', 18:47:58 INFO - 'SHLVL': '1', 18:47:58 INFO - 'TERM': 'linux', 18:47:58 INFO - 'TMOUT': '86400', 18:47:58 INFO - 'USER': 'cltbld', 18:47:58 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', 18:47:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:47:58 INFO - '_': '/tools/buildbot/bin/python'} 18:47:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:47:58 INFO - Downloading/unpacking blobuploader==1.2.4 18:47:58 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 18:47:58 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 18:47:58 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 18:47:58 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 18:47:58 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 18:47:58 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 18:48:00 INFO - Downloading blobuploader-1.2.4.tar.gz 18:48:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 18:48:00 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 18:48: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 18:48: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 18:48: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 18:48: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 18:48: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 18:48: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 18:48:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 18:48:00 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 18:48: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 18:48: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 18:48: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 18:48: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 18:48: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 18:48: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 18:48:00 INFO - Downloading docopt-0.6.1.tar.gz 18:48:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 18:48:00 INFO - Installing collected packages: blobuploader, requests, docopt 18:48:00 INFO - Running setup.py install for blobuploader 18:48:00 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 18:48:00 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 18:48:00 INFO - Running setup.py install for requests 18:48:01 INFO - Running setup.py install for docopt 18:48:01 INFO - Successfully installed blobuploader requests docopt 18:48:01 INFO - Cleaning up... 18:48:01 INFO - Return code: 0 18:48:01 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 18:48:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:48:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:48:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:48:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:48:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:48:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:48:01 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 0x7f68f4cd0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16178a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16e6230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17787f0>, '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 0x16e42d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16e4760>, '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': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', '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 18:48:01 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 18:48:01 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 18:48:01 INFO - Using env: {'DISPLAY': ':0', 18:48:01 INFO - 'HOME': '/home/cltbld', 18:48:01 INFO - 'LANG': 'en_US.UTF-8', 18:48:01 INFO - 'LANGUAGE': 'en_US:en', 18:48:01 INFO - 'LOGNAME': 'cltbld', 18:48:01 INFO - 'MAIL': '/var/mail/cltbld', 18:48:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:48:01 INFO - 'MOZ_NO_REMOTE': '1', 18:48:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:48:01 INFO - 'NO_EM_RESTART': '1', 18:48:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:48:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:48:01 INFO - 'PWD': '/builds/slave/test-pgo', 18:48:01 INFO - 'SHELL': '/bin/bash', 18:48:01 INFO - 'SHLVL': '1', 18:48:01 INFO - 'TERM': 'linux', 18:48:01 INFO - 'TMOUT': '86400', 18:48:01 INFO - 'USER': 'cltbld', 18:48:01 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', 18:48:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:48:01 INFO - '_': '/tools/buildbot/bin/python'} 18:48:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:48:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 18:48:01 INFO - Running setup.py (path:/tmp/pip-kbcVz6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 18:48:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 18:48:01 INFO - Running setup.py (path:/tmp/pip-9A1SO1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 18:48:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 18:48:01 INFO - Running setup.py (path:/tmp/pip-r_47yg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 18:48:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 18:48:01 INFO - Running setup.py (path:/tmp/pip-7ACCwQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 18:48:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 18:48:01 INFO - Running setup.py (path:/tmp/pip-fnkYnN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 18:48:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 18:48:01 INFO - Running setup.py (path:/tmp/pip-iGUaye-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 18:48:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 18:48:02 INFO - Running setup.py (path:/tmp/pip-n3B18U-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 18:48:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 18:48:02 INFO - Running setup.py (path:/tmp/pip-Xz54Ux-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 18:48:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 18:48:02 INFO - Running setup.py (path:/tmp/pip-r83Fon-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 18:48:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 18:48:02 INFO - Running setup.py (path:/tmp/pip-YaeQKR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 18:48:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 18:48:02 INFO - Running setup.py (path:/tmp/pip-TblIni-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 18:48:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 18:48:02 INFO - Running setup.py (path:/tmp/pip-exM_aN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 18:48:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 18:48:02 INFO - Running setup.py (path:/tmp/pip-fm9_sx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 18:48:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 18:48:02 INFO - Running setup.py (path:/tmp/pip-obuOXf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 18:48:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 18:48:02 INFO - Running setup.py (path:/tmp/pip-dbCyjY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 18:48:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 18:48:02 INFO - Running setup.py (path:/tmp/pip-A67WVE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 18:48:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 18:48:02 INFO - Running setup.py (path:/tmp/pip-EYMPTj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 18:48:02 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 18:48:02 INFO - Running setup.py install for manifestparser 18:48:02 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 18:48:02 INFO - Running setup.py install for mozcrash 18:48:03 INFO - Running setup.py install for mozdebug 18:48:03 INFO - Running setup.py install for mozdevice 18:48:03 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 18:48:03 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 18:48:03 INFO - Running setup.py install for mozfile 18:48:03 INFO - Running setup.py install for mozhttpd 18:48:03 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 18:48:03 INFO - Running setup.py install for mozinfo 18:48:03 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 18:48:03 INFO - Running setup.py install for mozInstall 18:48:03 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 18:48:03 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 18:48:03 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 18:48:03 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 18:48:03 INFO - Running setup.py install for mozleak 18:48:03 INFO - Running setup.py install for mozlog 18:48:03 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 18:48:03 INFO - Running setup.py install for moznetwork 18:48:03 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 18:48:03 INFO - Running setup.py install for mozprocess 18:48:04 INFO - Running setup.py install for mozprofile 18:48:04 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 18:48:04 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 18:48:04 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 18:48:04 INFO - Running setup.py install for mozrunner 18:48:04 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 18:48:04 INFO - Running setup.py install for mozscreenshot 18:48:04 INFO - Running setup.py install for moztest 18:48:04 INFO - Running setup.py install for mozversion 18:48:04 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 18:48:04 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 18:48:04 INFO - Cleaning up... 18:48:04 INFO - Return code: 0 18:48:04 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 18:48:04 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')]} 18:48:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:48:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:48:04 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')]} 18:48:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:48:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:48:04 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 0x7f68f4cd0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16178a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16e6230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17787f0>, '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 0x16e42d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16e4760>, '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': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', '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 18:48:04 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 18:48:04 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 18:48:04 INFO - Using env: {'DISPLAY': ':0', 18:48:04 INFO - 'HOME': '/home/cltbld', 18:48:04 INFO - 'LANG': 'en_US.UTF-8', 18:48:04 INFO - 'LANGUAGE': 'en_US:en', 18:48:04 INFO - 'LOGNAME': 'cltbld', 18:48:04 INFO - 'MAIL': '/var/mail/cltbld', 18:48:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:48:04 INFO - 'MOZ_NO_REMOTE': '1', 18:48:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:48:04 INFO - 'NO_EM_RESTART': '1', 18:48:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:48:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:48:04 INFO - 'PWD': '/builds/slave/test-pgo', 18:48:04 INFO - 'SHELL': '/bin/bash', 18:48:04 INFO - 'SHLVL': '1', 18:48:04 INFO - 'TERM': 'linux', 18:48:04 INFO - 'TMOUT': '86400', 18:48:04 INFO - 'USER': 'cltbld', 18:48:04 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', 18:48:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:48:04 INFO - '_': '/tools/buildbot/bin/python'} 18:48:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:48:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 18:48:04 INFO - Running setup.py (path:/tmp/pip-HmLqcp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 18:48:04 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)) 18:48:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 18:48:04 INFO - Running setup.py (path:/tmp/pip-zk_0uT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 18:48:04 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)) 18:48:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 18:48:04 INFO - Running setup.py (path:/tmp/pip-c9Gd6L-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 18:48:05 INFO - Running setup.py (path:/tmp/pip-OFxKb_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 18:48:05 INFO - Running setup.py (path:/tmp/pip-g_bwCi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 18:48:05 INFO - Running setup.py (path:/tmp/pip-0OaOHr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 18:48:05 INFO - Running setup.py (path:/tmp/pip-4KkhnJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 18:48:05 INFO - Running setup.py (path:/tmp/pip-MqqjD8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 18:48:05 INFO - Running setup.py (path:/tmp/pip-45Fjvc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 18:48:05 INFO - Running setup.py (path:/tmp/pip-uFD02V-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 18:48:05 INFO - Running setup.py (path:/tmp/pip-FIOdNv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 18:48:05 INFO - Running setup.py (path:/tmp/pip-qQ7Ge0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 18:48:05 INFO - Running setup.py (path:/tmp/pip-TW9F_F-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 18:48:05 INFO - Running setup.py (path:/tmp/pip-Tz4YmI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 18:48:05 INFO - Running setup.py (path:/tmp/pip-7tlm2u-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 18:48:05 INFO - Running setup.py (path:/tmp/pip-oaPtvo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 18:48:05 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)) 18:48:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 18:48:05 INFO - Running setup.py (path:/tmp/pip-laS9Bx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 18:48:06 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)) 18:48:06 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)) 18:48:06 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)) 18:48:06 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)) 18:48:06 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)) 18:48:06 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)) 18:48:06 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 18:48:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:48:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:48:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:48:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:48:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:48:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:48:07 INFO - Downloading blessings-1.6.tar.gz 18:48:07 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 18:48:07 INFO - Installing collected packages: blessings 18:48:07 INFO - Running setup.py install for blessings 18:48:07 INFO - Successfully installed blessings 18:48:07 INFO - Cleaning up... 18:48:08 INFO - Return code: 0 18:48:08 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 18:48:08 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 18:48:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 18:48:08 INFO - Reading from file tmpfile_stdout 18:48:08 INFO - Current package versions: 18:48:08 INFO - argparse == 1.2.1 18:48:08 INFO - blessings == 1.6 18:48:08 INFO - blobuploader == 1.2.4 18:48:08 INFO - docopt == 0.6.1 18:48:08 INFO - manifestparser == 1.1 18:48:08 INFO - mozInstall == 1.12 18:48:08 INFO - mozcrash == 0.16 18:48:08 INFO - mozdebug == 0.1 18:48:08 INFO - mozdevice == 0.48 18:48:08 INFO - mozfile == 1.2 18:48:08 INFO - mozhttpd == 0.7 18:48:08 INFO - mozinfo == 0.9 18:48:08 INFO - mozleak == 0.1 18:48:08 INFO - mozlog == 3.1 18:48:08 INFO - moznetwork == 0.27 18:48:08 INFO - mozprocess == 0.22 18:48:08 INFO - mozprofile == 0.28 18:48:08 INFO - mozrunner == 6.11 18:48:08 INFO - mozscreenshot == 0.1 18:48:08 INFO - mozsystemmonitor == 0.0 18:48:08 INFO - moztest == 0.7 18:48:08 INFO - mozversion == 1.4 18:48:08 INFO - psutil == 3.1.1 18:48:08 INFO - requests == 1.2.3 18:48:08 INFO - wsgiref == 0.1.2 18:48:08 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 18:48: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')]} 18:48:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:48:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:48: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')]} 18:48:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:48:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:48: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/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 0x7f68f4cd0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16178a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16e6230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17787f0>, '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 0x16e42d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16e4760>, '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': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', '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 18:48:08 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 18:48:08 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 18:48:08 INFO - Using env: {'DISPLAY': ':0', 18:48:08 INFO - 'HOME': '/home/cltbld', 18:48:08 INFO - 'LANG': 'en_US.UTF-8', 18:48:08 INFO - 'LANGUAGE': 'en_US:en', 18:48:08 INFO - 'LOGNAME': 'cltbld', 18:48:08 INFO - 'MAIL': '/var/mail/cltbld', 18:48:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:48:08 INFO - 'MOZ_NO_REMOTE': '1', 18:48:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:48:08 INFO - 'NO_EM_RESTART': '1', 18:48:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:48:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:48:08 INFO - 'PWD': '/builds/slave/test-pgo', 18:48:08 INFO - 'SHELL': '/bin/bash', 18:48:08 INFO - 'SHLVL': '1', 18:48:08 INFO - 'TERM': 'linux', 18:48:08 INFO - 'TMOUT': '86400', 18:48:08 INFO - 'USER': 'cltbld', 18:48:08 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', 18:48:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:48:08 INFO - '_': '/tools/buildbot/bin/python'} 18:48:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:48:08 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)) 18:48:08 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)) 18:48:08 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)) 18:48:08 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)) 18:48:08 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)) 18:48:08 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)) 18:48:08 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)) 18:48:08 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)) 18:48:08 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)) 18:48:08 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)) 18:48:08 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)) 18:48:08 INFO - Cleaning up... 18:48:08 INFO - Return code: 0 18:48:08 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 18:48: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')]} 18:48:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:48:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:48: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')]} 18:48:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:48:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:48:08 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 0x7f68f4cd0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16178a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16e6230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17787f0>, '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 0x16e42d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16e4760>, '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': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', '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 18:48:08 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 18:48:08 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 18:48:08 INFO - Using env: {'DISPLAY': ':0', 18:48:08 INFO - 'HOME': '/home/cltbld', 18:48:08 INFO - 'LANG': 'en_US.UTF-8', 18:48:08 INFO - 'LANGUAGE': 'en_US:en', 18:48:08 INFO - 'LOGNAME': 'cltbld', 18:48:08 INFO - 'MAIL': '/var/mail/cltbld', 18:48:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:48:08 INFO - 'MOZ_NO_REMOTE': '1', 18:48:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:48:08 INFO - 'NO_EM_RESTART': '1', 18:48:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:48:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:48:08 INFO - 'PWD': '/builds/slave/test-pgo', 18:48:08 INFO - 'SHELL': '/bin/bash', 18:48:08 INFO - 'SHLVL': '1', 18:48:08 INFO - 'TERM': 'linux', 18:48:08 INFO - 'TMOUT': '86400', 18:48:08 INFO - 'USER': 'cltbld', 18:48:08 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', 18:48:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:48:08 INFO - '_': '/tools/buildbot/bin/python'} 18:48:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:48:08 INFO - Downloading/unpacking jsonschema 18:48:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:48:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:48:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:48:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:48:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:48:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:48:10 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 18:48:10 INFO - Downloading/unpacking functools32 (from jsonschema) 18:48: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 18:48: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 18:48: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 18:48: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 18:48: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 18:48: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 18:48:10 INFO - Downloading functools32-3.2.3-2.tar.gz 18:48:10 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 18:48:10 INFO - warning: no files found matching '*.txt' 18:48:10 INFO - no previously-included directories found matching 'build' 18:48:10 INFO - no previously-included directories found matching 'dist' 18:48:10 INFO - no previously-included directories found matching '.git*' 18:48:10 INFO - Installing collected packages: jsonschema, functools32 18:48:10 INFO - Running setup.py install for functools32 18:48:10 INFO - warning: no files found matching '*.txt' 18:48:10 INFO - no previously-included directories found matching 'build' 18:48:10 INFO - no previously-included directories found matching 'dist' 18:48:10 INFO - no previously-included directories found matching '.git*' 18:48:10 INFO - Successfully installed jsonschema functools32 18:48:10 INFO - Cleaning up... 18:48:10 INFO - Return code: 0 18:48:10 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 18:48:10 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')]} 18:48:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:48:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:48:10 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')]} 18:48:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:48:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:48:10 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 0x7f68f4cd0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16178a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16e6230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17787f0>, '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 0x16e42d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16e4760>, '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': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', '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 18:48:10 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 18:48:10 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 18:48:10 INFO - Using env: {'DISPLAY': ':0', 18:48:10 INFO - 'HOME': '/home/cltbld', 18:48:10 INFO - 'LANG': 'en_US.UTF-8', 18:48:10 INFO - 'LANGUAGE': 'en_US:en', 18:48:10 INFO - 'LOGNAME': 'cltbld', 18:48:10 INFO - 'MAIL': '/var/mail/cltbld', 18:48:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:48:10 INFO - 'MOZ_NO_REMOTE': '1', 18:48:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:48:10 INFO - 'NO_EM_RESTART': '1', 18:48:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:48:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:48:10 INFO - 'PWD': '/builds/slave/test-pgo', 18:48:10 INFO - 'SHELL': '/bin/bash', 18:48:10 INFO - 'SHLVL': '1', 18:48:10 INFO - 'TERM': 'linux', 18:48:10 INFO - 'TMOUT': '86400', 18:48:10 INFO - 'USER': 'cltbld', 18:48:10 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', 18:48:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:48:10 INFO - '_': '/tools/buildbot/bin/python'} 18:48:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:48:11 INFO - Downloading/unpacking flake8 18:48:11 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 18:48:11 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 18:48:11 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 18:48:11 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 18:48:11 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 18:48:11 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 18:48:12 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 18:48:12 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 18:48:12 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 18:48:12 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 18:48:12 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 18:48:12 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 18:48:12 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 18:48:12 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 18:48:13 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 18:48:13 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 18:48: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 18:48: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 18:48: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 18:48: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 18:48: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 18:48: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 18:48:13 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 18:48: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 18:48: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 18:48: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 18:48: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 18:48: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 18:48: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 18:48:13 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 18:48:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 18:48:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 18:48:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 18:48:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 18:48:13 INFO - no previously-included directories found matching 'docs/_build' 18:48:13 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 18:48:13 INFO - Running setup.py install for pep8 18:48:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 18:48:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 18:48:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 18:48:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 18:48:13 INFO - no previously-included directories found matching 'docs/_build' 18:48:13 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 18:48:13 INFO - Successfully installed flake8 mccabe pyflakes pep8 18:48:13 INFO - Cleaning up... 18:48:13 INFO - Return code: 0 18:48:13 INFO - Running post-action listener: _resource_record_post_action 18:48:13 INFO - Running post-action listener: _start_resource_monitoring 18:48:13 INFO - Starting resource monitoring. 18:48:13 INFO - ##### 18:48:13 INFO - ##### Running install step. 18:48:13 INFO - ##### 18:48:13 INFO - Running pre-action listener: _resource_record_pre_action 18:48:13 INFO - Running main action method: install 18:48:13 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 18:48:13 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 18:48:14 INFO - Reading from file tmpfile_stdout 18:48:14 INFO - Detecting whether we're running mozinstall >=1.0... 18:48:14 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 18:48:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 18:48:14 INFO - Reading from file tmpfile_stdout 18:48:14 INFO - Output received: 18:48:14 INFO - Usage: mozinstall [options] installer 18:48:14 INFO - Options: 18:48:14 INFO - -h, --help show this help message and exit 18:48:14 INFO - -d DEST, --destination=DEST 18:48:14 INFO - Directory to install application into. [default: 18:48:14 INFO - "/builds/slave/test-pgo"] 18:48:14 INFO - --app=APP Application being installed. [default: firefox] 18:48:14 INFO - mkdir: /builds/slave/test-pgo/build/application 18:48:14 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 18:48:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 18:48:30 INFO - Reading from file tmpfile_stdout 18:48:30 INFO - Output received: 18:48:30 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 18:48:30 INFO - Running post-action listener: _resource_record_post_action 18:48:30 INFO - ##### 18:48:30 INFO - ##### Running run-tests step. 18:48:30 INFO - ##### 18:48:30 INFO - Running pre-action listener: _resource_record_pre_action 18:48:30 INFO - Running main action method: run_tests 18:48:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 18:48:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 18:48:30 INFO - Python 2.7.3 18:48:30 INFO - Return code: 0 18:48:30 INFO - grabbing minidump binary from tooltool 18:48:30 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')]} 18:48:30 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 0x17787f0>, '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 0x16e42d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16e4760>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 18:48:30 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 18:48:30 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 18:48:30 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 18:48:30 INFO - Return code: 0 18:48:30 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 18:48:30 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 18:48:30 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 18:48:30 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 18:48:30 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 18:48:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 18:48:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 18:48:31 INFO - Return code: 0 18:48:31 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-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-046', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test-pgo/build 18:48:31 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-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-046 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log 18:48:31 INFO - Using env: {'DISPLAY': ':0', 18:48:31 INFO - 'HOME': '/home/cltbld', 18:48:31 INFO - 'LANG': 'en_US.UTF-8', 18:48:31 INFO - 'LANGUAGE': 'en_US:en', 18:48:31 INFO - 'LOGNAME': 'cltbld', 18:48:31 INFO - 'MAIL': '/var/mail/cltbld', 18:48:31 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 18:48:31 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 18:48:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:48:31 INFO - 'MOZ_NO_REMOTE': '1', 18:48:31 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 18:48:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:48:31 INFO - 'NO_EM_RESTART': '1', 18:48:31 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:48:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 18:48:31 INFO - 'PWD': '/builds/slave/test-pgo', 18:48:31 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 18:48:31 INFO - 'SHELL': '/bin/bash', 18:48:31 INFO - 'SHLVL': '1', 18:48:31 INFO - 'TERM': 'linux', 18:48:31 INFO - 'TMOUT': '86400', 18:48:31 INFO - 'USER': 'cltbld', 18:48:31 INFO - 'XDG_SESSION_COOKIE': '652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317', 18:48:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:48:31 INFO - '_': '/tools/buildbot/bin/python'} 18:48:31 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-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-046', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 18:48:31 INFO - mozversion application_buildid: 20160124163006 18:48:31 INFO - mozversion application_changeset: 4ea6060b39285038ae811da6b5b343393dc69d90 18:48:31 INFO - mozversion application_display_name: Nightly 18:48:31 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 18:48:31 INFO - mozversion application_name: Firefox 18:48:31 INFO - mozversion application_remotingname: firefox 18:48:31 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 18:48:31 INFO - mozversion application_vendor: Mozilla 18:48:31 INFO - mozversion application_version: 46.0a1 18:48:31 INFO - mozversion platform_buildid: 20160124163006 18:48:31 INFO - mozversion platform_changeset: 4ea6060b39285038ae811da6b5b343393dc69d90 18:48:31 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 18:48:31 INFO - mozversion platform_version: 46.0a1 18:48:31 INFO - using testdate: 1453690111 18:48:31 INFO - actual date: 1453690111 18:48:31 INFO - starting webserver on 'localhost:45156' 18:48:31 INFO - SUITE-START | Running 3 tests 18:48:31 INFO - TEST-START | dromaeo_css 18:48:31 INFO - operating with platform_type : linux_ 18:48:31 INFO - Initialising browser for dromaeo_css test... 18:48:31 INFO - TEST-INFO | started process 30412 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpNqertt/profile http://localhost:45156/getInfo.html) 18:48:35 INFO - PROCESS | 30412 | 18:48:35 INFO - PROCESS | 30412 | (process:30495): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 18:48:36 INFO - PROCESS | 30412 | __metrics Screen width/height:1600/1200 18:48:36 INFO - PROCESS | 30412 | colorDepth:24 18:48:36 INFO - PROCESS | 30412 | Browser inner width/height: 1024/697 18:48:36 INFO - PROCESS | 30412 | __metrics 18:48:36 INFO - PROCESS | 30412 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 18:48:37 INFO - TEST-INFO | 30412: exit 0 18:48:37 INFO - Browser initialized. 18:48:37 INFO - Running cycle 1/1 for dromaeo_css test... 18:48:37 INFO - TEST-INFO | started process 30544 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpNqertt/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:48:38 INFO - PROCESS | 30544 | 18:48:38 INFO - PROCESS | 30544 | (process:30602): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 18:48:48 INFO - PROCESS | 30544 | RSS: Main: 150122496 18:48:48 INFO - PROCESS | 30544 | 18:49:38 INFO - PROCESS | 30544 | 1453690178504 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] 18:51:47 INFO - PROCESS | 30544 | Cycle 1(1): loaded http://localhost:45156/tests/dromaeo/cssquery-dojo.html (next: http://localhost:45156/tests/dromaeo/cssquery-ext.html) 18:51:48 INFO - PROCESS | 30544 | RSS: Main: 160755712 18:51:48 INFO - PROCESS | 30544 | 18:54:50 INFO - PROCESS | 30544 | Cycle 1(1): loaded http://localhost:45156/tests/dromaeo/cssquery-ext.html (next: http://localhost:45156/tests/dromaeo/cssquery-jquery.html) 18:54:51 INFO - PROCESS | 30544 | RSS: Main: 156786688 18:54:51 INFO - PROCESS | 30544 | 18:57:52 INFO - PROCESS | 30544 | Cycle 1(1): loaded http://localhost:45156/tests/dromaeo/cssquery-jquery.html (next: http://localhost:45156/tests/dromaeo/cssquery-mootools.html) 18:57:53 INFO - PROCESS | 30544 | RSS: Main: 156442624 18:57:53 INFO - PROCESS | 30544 | 19:00:55 INFO - PROCESS | 30544 | Cycle 1(1): loaded http://localhost:45156/tests/dromaeo/cssquery-mootools.html (next: http://localhost:45156/tests/dromaeo/cssquery-prototype.html) 19:00:55 INFO - PROCESS | 30544 | RSS: Main: 154349568 19:00:55 INFO - PROCESS | 30544 | 19:03:58 INFO - PROCESS | 30544 | Cycle 1(1): loaded http://localhost:45156/tests/dromaeo/cssquery-prototype.html (next: http://localhost:45156/tests/dromaeo/cssquery-yui.html) 19:03:58 INFO - PROCESS | 30544 | RSS: Main: 154546176 19:03:58 INFO - PROCESS | 30544 | 19:07:01 INFO - PROCESS | 30544 | Cycle 1(1): loaded http://localhost:45156/tests/dromaeo/cssquery-yui.html (next: http://localhost:45156/tests/dromaeo/cssquery-dojo.html) 19:07:01 INFO - PROCESS | 30544 | RSS: Main: 158121984 19:07:01 INFO - PROCESS | 30544 | 19:07:01 INFO - PROCESS | 30544 | __start_tp_report 19:07:01 INFO - PROCESS | 30544 | _x_x_mozilla_page_load 19:07:01 INFO - PROCESS | 30544 | _x_x_mozilla_page_load_details 19:07:01 INFO - PROCESS | 30544 | |i|pagename|runs| 19:07:01 INFO - PROCESS | 30544 | |0;dojo.html;3186.028261380279;3206.9679303206963;3237.4172648923186;3247.269364393012;3255.3977514159883;5248.370195576526;5273.551748101411;5289.788408463662;5331.520163185312;5338.786448542063;5209.2707021016995;5246.396664383597;5267.0256002639535;5319.946800531993;5404.91892621611;4757.381540399751;4795.880102997418;4840.661153719241;4858.659893807435;4914.140025495524;4579.473360563545;4893.632977526682;4895.849475373302;4933.901321973576;4969.180085285923;4751.691140075901;4816.614670826326;4857.951420485821;4858.17411040124;4941.160002799496;4797.2564252540915;4806.95193048072;4809.615230781529;4823.831165909211;4841.685290456109;4771.6421268404665;4775.761211939423;4776.188048031843;4791.544803243686;4820.542048505386;5048.924266136011;5103.157978933472;5113.258577506278;5178.223266510016;5204.8178313758835;5669.177969194444;5697.658140511582;5709.229254050691;5727.914081288784;5731.856703582402;5670.744816483269;5749.626274292157;5751;5758.6544807311275;5762.250907382056;5343.946560534384;5409.810656626999;5452.345718513804;5459.454054594588;5502.9174562381595;5814.476697097281;5815.331236907725;5826.737796799154;5833.620814647034;5847.152162936351;5478.863028424321;5541.889162216814;5599.1041433370465;5620;5622.550195984311;5693.345265294544;5746.080627099644;5756.222909907193;5764.654120752684;5793.2179155814265;5651.547876169897;5664.631798933056;5678.744456499468;5687.061634830289;5709.086546152679;5554.389017208104;5682.948654498931;5686.658800471985;5715.142728590745;5735.856603584861;4384.758838263862;4389.517153113155;4453.710508816916;4516.187086324493;4532.229520981441;3970.9205815884097;3973.046468847456;3974.900627484278;3999.3601023836627;4006.719529632956;5366.7048312343195;5394.352677678704;5398.109311963561;5398.757055932492;5419.783208671688;5630.97184514083;5696.231008813757;5705.771769129271;5717.628354156966;5720.628159169641;5374.785008599612;5376.865578360494;5377.542908852792;5389.191621256843;5428.022955867903;4828.203346447796;4858.78135483904;4869.902601947942;4871.488493708181;4897.4857639948;5766.913496297559;5850.5027072699295;5851.180834683148;5858.2677165354335;5889.646621202742;5698.886022279614;5700.629459085146;5712.857178570569;5738.340090889601;5743.942560574508;5813.128030795415;5880.764769409176;5899.970500147472;5922.3485416605;5931.703414829328;5597.580181486486;5632.549396048388;5663.490285874291;5684.317881854038;5702.429757024264;5734.627249228787;5737.91393129095;5740.282464691913;5760.855978600569;5765.625234359753;5568.9443105568425;5571.331440227199;5576.749046292845;5618.438156184349;5677.858053548694;5637.915431268452;5655.632383895034;5669.461401166883;5683.147527870852;5731.828045158652;5537.861553461195;5546.861328466821;5572.60991730575;5581.944180558143;5584.106542953108;5556.305461817273;5590.692511911884;5594.188842617717;5649.971750141223;5654.604177707685;5534;5560.860978475571;5569.248151499658;5594.104943209067;5620 19:07:01 INFO - PROCESS | 30544 | |1;ext.html;532.1379365428007;532.5313723922948;532.904077266092;552.7125894534842;579.7825815319255;35211.47182792257;35836.10409739755;36075;36101.81949090251;36128.27743445136;39271.41092883609;39550.80224598873;39568.60431395685;39570.8021459893;39701.40447893284;8435.70475033374;8515.23362897339;8519.616617252208;8631.654733810672;8647.221750042494;8255.752327430157;8387.329013678922;8442.535660538668;8444.324454043692;8455.365847561427;8240.752777416657;8318.792030199233;8369.916300837005;8385.035720892114;8391.95804020979;8551.529665868375;8577.27093197079;8672.8699069514;8678.609462574199;8680.522571258547;8485.915140848574;8585.356098292654;8624.396292259482;8627.352948528885;8631.136886311382;38412.23175536474;38449.423258650866;38768;38829.805850970566;38922.61077389218;2922.006517783964;3187.665295144023;3228.515722641599;3408.9659103409144;3725.4411838224214;29501.262468438246;29593.400469689183;29873.25316867074;29996.250093747614;30448.391032179454;3423.96576034239;3536.4341705327283;3663;3797.9810100949594;3992.3612222044335;258644;259348.9999999981;259719;260522;262207;54936.45063549393;54952;55988.720056399456;57823;59385.10922336169;51381.743091285054;51642.483575163766;51875.74062129741;52023.47976520262;52235.21647175295;14107.576772696835;14188.787168192486;14260.215688137252;14295.28523573817;14330.928345358207;11155.609553665583;11184.217104802585;11216.439178041066;11289.379084150287;11303.660890173307;19105.7517237263;19464.221431142596;19548.55004956885;19727.802721972883;19758.50603734918;7072.787816365517;7257.564546127249;7263.818404539928;7280.708771649181;7283.490155689157;875.7329014650466;891.64334266294;911.5761171055359;1023.2785885950387;1045.451138152476;25772.484550308887;28588.14235572936;28871.566926496118;29019.41961160765;29083.7091629081;994.264244459095;1057.5452555401098;1063.4151216830712;1067.3595842494442;1156.0522151898767;14429.639259018608;14481;14516.854831451761;14765.926170369079;14781.482648107265;325290;331016;331345;331923;332748;50456;50534.24198637023;50592.74703626458;50821.23768143481;50866.74566627143;1300.3238316075588;1302.3618426970907;1310.1745900082888;1327.1705184259838;1333.093496422442;24124;24784;24943.12699055597;25052.749472505042;25175.118870839433;45904;45910;46249.537504624524;46274.53725462702;46505.302420464395;300155;302365;302851;304654;305351;32244.19389515281;32509.837450812596;32662.366881656297;32883.671163289015;33141.66858331386;32191;32558.674413255565;32682.019539413857;32857;32891;28147.71852281533;28249.57625635658;28266;28600.57099143556;28823;28331.858340708164;28995.710042900144;29664.937894095434;29999.700003000562;30356.54465183068;29088.56367154452;29343;29763.255918601342;29798.25504362408;29938.70061299359;28676.42647147087;32252.67747322497;32539.34921301608;32609;32737.67262327346;24775.50448991046;32098.19754506156;32140.357192856478;32514.349713006082;33244 19:07:01 INFO - PROCESS | 30544 | |2;jquery.html;363.47114947751027;365.2293660376605;366.41556717036326;367.029207745513;368.99631003689956;15747.976381535193;16322.183890805456;16873.915630421863;17091.999999999985;17512.649747005053;14792.18642974636;14818.55544333669;15313.004654697437;15650.217489125527;15756.606084847856;4716.834910778132;5002.424721157077;5005.54950054495;5006.098902197603;5016.021875734234;4374.212641724488;4708.246680531116;4825.638077144211;4917.4836642152595;4983.800647974077;4947.876303092416;5008.048470790538;5016.046951079284;5161.509656582619;5162.948370516285;4553.544645535453;5093.261477085839;5144.202648589456;5156.458571849958;5513.448655134454;5281.181416880389;5283.445238249967;5288.444713305086;5293.179557168645;5311.468853114697;13042.804357934638;19046.80953190464;19875.403737887886;19897.403077907686;20005.699914501292;2058.084152552115;2072.575122099966;2122.4375540481783;2179.259051922354;2184.7378314602192;8808.823823523559;10302.433366164858;11666.949974502335;12556.309402982832;12911.870881291161;1776.8045514993341;1780.235408782825;1858.7118996555555;1864.673682105626;1882.218879165145;51945.99999999962;52742;53398.466015339734;53497;56607;9500.619975201053;9982.401055936522;10228.948855255676;10231.846522302172;10327.638532651321;13523.797143042862;13574.25341606221;13630.93184534071;13631.727365452834;13691.931540342433;7478.700851965969;7525.059367579052;7532.17146113927;7560.546367217985;7606.277403646644;7121.928780712126;7124.857502850017;7129.572225666477;7177.138743350727;7190.856182876313;4270.615644592001;4400.031992961543;4440.4671439427475;4458.420405347284;4535.092981403733;1740.6692728381568;1789.7762779652544;1832.2854086906118;1838.108517369075;1856.8700190986772;835.3985130705883;917.8439665256923;946.3044662173297;963.3978415513905;1057.677408390433;14940.701185976219;15880.682386352208;16210.432634857723;16220.51338459848;16481.17594120289;875.776676947387;931.6413180925257;1002.0580654185043;1009.7122320138725;1017.0015918719752;9351.597260410857;9604.183644390165;9613.423194608346;9615.51922403877;9628.47043412619;335441;345278;485365;491229;491457;46122;49943;70000;70849.6457517709;75457.24542754612;1091.1816137896578;1099.8240281554754;1124.4040658451033;1151.3034614058543;1168.5325869652206;14881;14887.47893823711;15051.77422338644;15134.167620780963;15434.305456254271;20019.898905560334;20830.895845520674;29439.969601063858;33601.83199083989;34258.314833703684;42802.57197427986;42987.570124298356;43181.56818431775;44427;44759.55240447684;6980.441564674916;7270.563766174047;7392.667329970272;7412.777616671508;7435.776926692208;8914.286857051291;10859.131269498579;11034.613788517363;11224.831627525431;11403;8600.311975041857;8868.822623547621;9052.411593246417;9188.58651360677;9303.72088837336;9469.195118414736;9627.374220675634;10034.69895903124;10075.09324160829;10141.695749127539;8953.552322383724;9238.95380523093;9738.561764720464;9802.65690700822;9975.750606234902;7215.458840586872;7330.120385553768;7447.962760186165;7497.737579184703;7573.242675732383;8101.878471823045;8951;9304.488253146143;9375.859362109437;9377.624895004396 19:07:01 INFO - PROCESS | 30544 | |3;mootools.html;1192.6779769462246;1193.832863399124;1233.97532049359;1709.4102534625558;1716.9742453863187;7498.662560184791;7693.422993275506;7695.307422331989;7880.054393472784;7906.881396779046;7652.1582625911105;7676.923230767705;7736.690532378712;7767.339776119023;7773.7279195228175;2356.2342238772426;2374.9168779092734;2379.4884099918513;2382.297222319411;2391.7369089400154;2369.5853225685523;2375.821813364005;2428.380762905457;2436.2569416328015;2437.0982736387473;2068.327793467122;2101.8528702990798;2305.976940230593;2389.390705370128;2409.2170044735444;2248.685184074223;2260.977390226093;2262.4457008032973;2268.2174649745893;2272.36373815332;2285.645724912641;2342.121704360865;2352.047420794581;2355.4464700795297;2358.127492827665;7758.728444504415;7776.1057478389575;7784.844303113906;7790.922090779076;7817.218278172138;4767.833125840579;4837.637177211688;4842.32207490948;4844.418669759616;4866.31871537985;3050.6186726659166;3053.7709671774705;3116.143060658337;3164.161497203243;3178.396104740092;960.8366577681811;964.4406244378243;966.5457235099492;979.1579241852002;1017.4505766885873;10850.565977360897;10881.564737410574;10927.781444371147;10960.136776747971;10964.945175274152;4198.538160802309;4215.241256573785;4221.366794980778;4237.194932962727;4295.806688699016;8871.955640221757;8877;8877.1122887712;8889.511076890833;8929.285657147413;4666.253399456071;4674.906501869944;4675.392199014106;4687.437507499122;4702.623790096853;4340.696151269444;4351.6518678505645;4360.738355698668;4379.846705365297;4383.583559561836;3488.0582242794303;3501.1947252132154;3505.4741788731894;3519.0322661268356;3533.258015816656;1061.984070238947;1081.691717860406;1082.4317233452343;1084.3060441317564;1087.597588892115;978.9706308810747;984.5520288268821;1017.5878769098526;1020.3622735790132;1021.7701017271203;7173.246809084971;7201.063861697946;7214;7319.268073192638;7320.1581818090535;620.9751609935552;627.8273474794468;643.1381948189448;644.127207633659;774.4307933668749;5635.830925072254;5673.914891276634;5706.343770466449;5707.315122185364;5720.11338242573;8321.625526851307;8516.06323304436;8707.521086340186;9007.189352958134;9117.772055698528;8893.822123557493;8942.46345219289;8958;8990.955045224731;9036.502992335485;6960.129983752031;7069.964650176819;7110;7111.53775004623;7131.643417829087;6829.6585170742255;6879.862402751817;6904.965475172592;6916.688749006206;6935.583864968118;7928.722494712888;7979.441439099207;8108.75673729789;8135.227153420416;8185.181481851767;8176.754697359089;8207.425480216327;8290.668373265002;8315.376346773895;8325.209105135002;6329.683515824282;6332.461740752087;6337.588056776295;6402.935970640234;6466.644334561644;7072.045273888165;7116;7163.0329905462095;7177.964110179416;7189.2451292615615;6859.451243900576;6945.374916257561;6954.339337763106;7054.964725176341;7068.964655176691;6338.58799178052;6370.490360771035;6740;6841.863162736817;6931.1682598088555;6951.16586009682;6971.790846274417;6978.406835419046;6983.9650801745665;7018.859622807618;6456.709448074754;6469.3530646936815;6499.350064993652;6504.934950650433;6522.15212022434;6430.1319321892815;6564.573302735307;6602.735890564516;6607.108040414482;6617.139771829824 19:07:01 INFO - PROCESS | 30544 | |4;prototype.html;345.4196949125469;351.25358612947485;354.5107751303201;355.3266559869049;358.3442300589921;6221.844453888643;6243.313235544087;6287.779927702526;6336.27132879719;6398.3601639836;6239.719212635431;6266.436020758131;6279.591826531284;6284.245890493135;6287.811365659026;4766.451858036336;4782.904341913159;4805.831795887145;4808.2547205183255;4818.060478206751;4817.759112044401;4817.831375901844;4821.445533763609;4824.372831531896;4841.709497430148;4680.204365257914;4766.428028636568;4780.924292034282;4796.064767370364;4807.951920480803;4763.404574428179;4763.833265835697;4764.213904705719;4770.594499467549;4787.688800228009;4157.937630935538;4172.269852775782;4175.603317684815;4180.080382315886;4186.6859985500905;5913.704314784243;5946.762129514815;5950.940490595125;5967.910481342783;5974.2830860297045;5482.698451585161;5615.747291371898;5620.381758006616;5628.831135065913;5644.774209031634;6703.095082163894;6705.597664140168;6712.429443497309;6715.160604924385;6715.764948226789;4622.075584883003;4623;4642.117997580449;4642.512536183686;4657.6273898088075;6792.252852186256;6847.075644787989;6871.797435448776;6895.482838787061;6923.169219693669;4642.46611639659;4649.325847752057;4695.178343789823;4711.8350857719815;4726.787294571753;4749.050189962021;4758.405199350082;4762.547557981986;4763.3807605011125;4773.76131193439;5534.280543529316;5537;5546.528545073633;5564.4713752193475;5585.525230355384;6589.077529145923;6692.230393504809;6700.329967003261;6702.061711360413;6742.662866856637;1643.0388222889505;1675.2796297591908;1682.7055265328518;1685.1995302231587;1690.7971043474615;1122.180808010157;1124.4995976790412;1132.660201939415;1135.6536256441864;1140.7775483780583;6170.228721409824;6223.906641400383;6237.532185086136;6238.563300569007;6255.280642726054;6800.217974932946;6805.863882722417;6809;6820.31796820314;6823.454123670094;6078.483328917003;6183.134361189437;6217.751289948442;6224.751009959641;6244.594101383395;3683.9263214735556;3686.189038411545;3686.3548878946076;3690.132818787583;3696.8521259149334;7001.649917504104;7030.121234845645;7059.835127203954;7065.752698655625;7068.222495525488;6688.230853451915;6854.280300568468;6880.071190389333;6922.134733158356;6945.062416573799;6982.1970473395195;7001.719931202695;7021.403180729593;7032.542884712478;7048.682809273595;6724.092247546519;6756.763513277208;6760.763373282109;6776.186857577122;6778.525503214925;6599.571027883172;6636.303188165173;6696.296888826603;6713.362230588086;6738.932610674026;6905.75829845953;7010.68451919675;7016.824579385352;7032.6132062735;7044.788656340318;4634.86095417138;4661.417322834645;4682.2508398656055;4690.530946905282;4691.835785747482;6673.733050677918;6683.699233534599;6685.498587605852;6764.255931847394;6892.965535172292;6742.25835158142;6790.8641827164165;6799.456043516408;6815.216250131299;6835.487338449537;6649.933500664932;6687.699053542505;6693.698783554654;6705;6707.899381509379;6448.1295025171;6542.247641521096;6559.114519539801;6571.507136964842;6608.8347791305605;6764.966175169093;6765.560238584476;6776;6786.762463313958;6793.388595026471;6582.012698095133;6582.506312026521;6628.834279142867;6634.203895532567;6639.933600663931 19:07:01 INFO - PROCESS | 30544 | |5;yui.html;664.6743095883015;671.2146788257738;717.4009701898914;721.920588735239;727.4362369163894;12611.936940315298;12815.743685126316;12939.741205175902;12960.222386656807;12971.28657923815;11575.710607234823;11618.128640351986;11843.881561184386;13252.867471325284;13479.932600336984;794.7099308752292;807.9313258373045;808.2806302390877;808.9797755056142;809.0291650019971;795.8448102619991;814.9837003259931;817.2726273616486;821.1049955548451;821.2034326703089;846.4286606540561;847.7160151349306;851.9701810436636;856.755824589992;857.1342943626919;845.4335595151264;849.9532525711084;851.0383266908416;853.7182729699215;854.6709516836;622.2222222222222;623.6725718997517;625.193500384508;627.4697880291146;628.8302158417248;13120.868791312156;13176.341182940814;13192;13214.735705285937;13224.933875330562;11097.500612472377;11160.386178760165;11296.265742726779;11552.59565915189;11739.06087512997;10361.48192590375;10524.052835244787;10575.153987680967;10578.947105264502;10599.682009539727;4138.110306284163;4154.273002224599;4212.115455754295;4248.192843359751;4353.564643535621;45096.77451612754;45193.32210016852;45600.77199614014;45884.311735323994;46075.308870366636;9235.261179105655;9424.434533927986;9532.666356677622;9549.856752148584;9692.951535242279;16716.832831671527;16746.58133546671;16756.58108547296;16826.326946922232;16835.41076062332;7105.680244389015;7326.194118646945;7365.189829118793;7433.553986760811;7462.365698915544;4338.934915976263;4352.564743525622;4372.278574035248;4376.978115109404;4384.4519435070615;3051.2829485070993;3061.341811510536;3083.799553029046;3093.8453077346494;3095.3190298134373;530.4350866327349;543.7553101104519;545.1931141909995;545.2720617974968;545.868991442059;524.635378412;563.4703378823892;640.3564417760122;650.7299470719693;698.27728301208;8426.325893928593;8459.577021148918;8465.830683386297;8616.052234254226;9020.729378118667;540.1330863963283;589.8554854060783;594.658071608818;652.4421619515341;697.0694123345289;3713.925721485555;3809.8857034289017;3843.1160833008007;3949.427333036751;3977.960220397817;52577.474225258025;53722.73138634282;54571.72714136404;54661.72669136708;54693.45306546963;46073.30890036652;46860.531394686295;46874.29688554674;47723.28415073777;47731.28403073957;42542.574574253864;43239.13521729548;43321;43773.78113109478;43890;8062.234087761653;8210;8393.916060839314;8464.068952415353;8525.403221774417;31560.684393156695;31878.362432751677;32031.67968320287;32088.197795055312;32348.514772277966;40557;41092.1781564373;41687.1662566753;41846.86148538932;42633.78683106565;10582.417967011888;10593.629222977159;10616.766081088464;10827.621033263798;11128.888711112786;10673;10744.677659670222;10946.45267736594;10956.616518421817;11148.665540033811;10779.946100269763;10781.568737250422;10856.728581785519;10903.236773425784;11006.174536909604;10909.945450272699;10959.726006849574;11032.834507482556;11113.777724445305;11432.215253249387;10020.248481364073;10322.535485903303;10393.948030260102;10699.090577300705;10965.945170274097;8630.82738345217;8790.912090879265;8873.822523549621;8953.462792232487;9194.724158275263;8988.10118988096;9185.954070229605;9462.621495140118;9619.422834629944;9740.853887191839 19:07:01 INFO - PROCESS | 30544 | __end_tp_report 19:07:01 INFO - PROCESS | 30544 | __start_cc_report 19:07:01 INFO - PROCESS | 30544 | _x_x_mozilla_cycle_collect,320 19:07:01 INFO - PROCESS | 30544 | __end_cc_report 19:07:01 INFO - PROCESS | 30544 | __startTimestamp1453691221569__endTimestamp 19:07:01 INFO - PROCESS | 30544 | 19:07:01 INFO - PROCESS | 30544 | ------- Summary: start ------- 19:07:01 INFO - PROCESS | 30544 | Number of tests: 6 19:07:01 INFO - PROCESS | 30544 | 19:07:01 INFO - PROCESS | 30544 | [#0] dojo.html Cycles:165 Average:5306.95 Median:5560.86 stddev:583.13 (10.5%) stddev-sans-first:560.68 19:07:01 INFO - PROCESS | 30544 | Values: 3186.0 3207.0 3237.4 3247.3 3255.4 5248.4 5273.6 5289.8 5331.5 5338.8 5209.3 5246.4 5267.0 5319.9 5404.9 4757.4 4795.9 4840.7 4858.7 4914.1 4579.5 4893.6 4895.8 4933.9 4969.2 4751.7 4816.6 4858.0 4858.2 4941.2 4797.3 4807.0 4809.6 4823.8 4841.7 4771.6 4775.8 4776.2 4791.5 4820.5 5048.9 5103.2 5113.3 5178.2 5204.8 5669.2 5697.7 5709.2 5727.9 5731.9 5670.7 5749.6 5751.0 5758.7 5762.3 5343.9 5409.8 5452.3 5459.5 5502.9 5814.5 5815.3 5826.7 5833.6 5847.2 5478.9 5541.9 5599.1 5620.0 5622.6 5693.3 5746.1 5756.2 5764.7 5793.2 5651.5 5664.6 5678.7 5687.1 5709.1 5554.4 5682.9 5686.7 5715.1 5735.9 4384.8 4389.5 4453.7 4516.2 4532.2 3970.9 3973.0 3974.9 3999.4 4006.7 5366.7 5394.4 5398.1 5398.8 5419.8 5631.0 5696.2 5705.8 5717.6 5720.6 5374.8 5376.9 5377.5 5389.2 5428.0 4828.2 4858.8 4869.9 4871.5 4897.5 5766.9 5850.5 5851.2 5858.3 5889.6 5698.9 5700.6 5712.9 5738.3 5743.9 5813.1 5880.8 5900.0 5922.3 5931.7 5597.6 5632.5 5663.5 5684.3 5702.4 5734.6 5737.9 5740.3 5760.9 5765.6 5568.9 5571.3 5576.7 5618.4 5677.9 5637.9 5655.6 5669.5 5683.1 5731.8 5537.9 5546.9 5572.6 5581.9 5584.1 5556.3 5590.7 5594.2 5650.0 5654.6 5534.0 5560.9 5569.2 5594.1 5620.0 19:07:01 INFO - PROCESS | 30544 | 19:07:01 INFO - PROCESS | 30544 | [#1] ext.html Cycles:180 Average:45323.34 Median:32870.34 stddev:78399.84 (238.5%) stddev-sans-first:78547.64 19:07:01 INFO - PROCESS | 30544 | Values: 532.1 532.5 532.9 552.7 579.8 35211.5 35836.1 36075.0 36101.8 36128.3 39271.4 39550.8 39568.6 39570.8 39701.4 8435.7 8515.2 8519.6 8631.7 8647.2 8255.8 8387.3 8442.5 8444.3 8455.4 8240.8 8318.8 8369.9 8385.0 8392.0 8551.5 8577.3 8672.9 8678.6 8680.5 8485.9 8585.4 8624.4 8627.4 8631.1 38412.2 38449.4 38768.0 38829.8 38922.6 2922.0 3187.7 3228.5 3409.0 3725.4 29501.3 29593.4 29873.3 29996.3 30448.4 3424.0 3536.4 3663.0 3798.0 3992.4 258644.0 259349.0 259719.0 260522.0 262207.0 54936.5 54952.0 55988.7 57823.0 59385.1 51381.7 51642.5 51875.7 52023.5 52235.2 14107.6 14188.8 14260.2 14295.3 14330.9 11155.6 11184.2 11216.4 11289.4 11303.7 19105.8 19464.2 19548.6 19727.8 19758.5 7072.8 7257.6 7263.8 7280.7 7283.5 875.7 891.6 911.6 1023.3 1045.5 25772.5 28588.1 28871.6 29019.4 29083.7 994.3 1057.5 1063.4 1067.4 1156.1 14429.6 14481.0 14516.9 14765.9 14781.5 325290.0 331016.0 331345.0 331923.0 332748.0 50456.0 50534.2 50592.7 50821.2 50866.7 1300.3 1302.4 1310.2 1327.2 1333.1 24124.0 24784.0 24943.1 25052.7 25175.1 45904.0 45910.0 46249.5 46274.5 46505.3 300155.0 302365.0 302851.0 304654.0 305351.0 32244.2 32509.8 32662.4 32883.7 33141.7 32191.0 32558.7 32682.0 32857.0 32891.0 28147.7 28249.6 28266.0 28600.6 28823.0 28331.9 28995.7 29664.9 29999.7 30356.5 29088.6 29343.0 29763.3 29798.3 29938.7 28676.4 32252.7 32539.3 32609.0 32737.7 24775.5 32098.2 32140.4 32514.3 33244.0 19:07:01 INFO - PROCESS | 30544 | 19:07:01 INFO - PROCESS | 30544 | [#2] jquery.html Cycles:180 Average:23868.07 Median:4544.32 stddev:71270.09 (1568.3%) stddev-sans-first:71448.17 19:07:01 INFO - PROCESS | 30544 | Values: 363.5 365.2 366.4 367.0 369.0 15748.0 16322.2 16873.9 17092.0 17512.6 14792.2 14818.6 15313.0 15650.2 15756.6 4716.8 5002.4 5005.5 5006.1 5016.0 4374.2 4708.2 4825.6 4917.5 4983.8 4947.9 5008.0 5016.0 5161.5 5162.9 4553.5 5093.3 5144.2 5156.5 5513.4 5281.2 5283.4 5288.4 5293.2 5311.5 13042.8 19046.8 19875.4 19897.4 20005.7 2058.1 2072.6 2122.4 2179.3 2184.7 8808.8 10302.4 11666.9 12556.3 12911.9 1776.8 1780.2 1858.7 1864.7 1882.2 51946.0 52742.0 53398.5 53497.0 56607.0 9500.6 9982.4 10228.9 10231.8 10327.6 13523.8 13574.3 13630.9 13631.7 13691.9 7478.7 7525.1 7532.2 7560.5 7606.3 7121.9 7124.9 7129.6 7177.1 7190.9 4270.6 4400.0 4440.5 4458.4 4535.1 1740.7 1789.8 1832.3 1838.1 1856.9 835.4 917.8 946.3 963.4 1057.7 14940.7 15880.7 16210.4 16220.5 16481.2 875.8 931.6 1002.1 1009.7 1017.0 9351.6 9604.2 9613.4 9615.5 9628.5 335441.0 345278.0 485365.0 491229.0 491457.0 46122.0 49943.0 70000.0 70849.6 75457.2 1091.2 1099.8 1124.4 1151.3 1168.5 14881.0 14887.5 15051.8 15134.2 15434.3 20019.9 20830.9 29440.0 33601.8 34258.3 42802.6 42987.6 43181.6 44427.0 44759.6 6980.4 7270.6 7392.7 7412.8 7435.8 8914.3 10859.1 11034.6 11224.8 11403.0 8600.3 8868.8 9052.4 9188.6 9303.7 9469.2 9627.4 10034.7 10075.1 10141.7 8953.6 9239.0 9738.6 9802.7 9975.8 7215.5 7330.1 7448.0 7497.7 7573.2 8101.9 8951.0 9304.5 9375.9 9377.6 19:07:01 INFO - PROCESS | 30544 | 19:07:01 INFO - PROCESS | 30544 | [#3] mootools.html Cycles:180 Average:5351.75 Median:6461.68 stddev:2772.99 (42.9%) stddev-sans-first:2763.15 19:07:01 INFO - PROCESS | 30544 | Values: 1192.7 1193.8 1234.0 1709.4 1717.0 7498.7 7693.4 7695.3 7880.1 7906.9 7652.2 7676.9 7736.7 7767.3 7773.7 2356.2 2374.9 2379.5 2382.3 2391.7 2369.6 2375.8 2428.4 2436.3 2437.1 2068.3 2101.9 2306.0 2389.4 2409.2 2248.7 2261.0 2262.4 2268.2 2272.4 2285.6 2342.1 2352.0 2355.4 2358.1 7758.7 7776.1 7784.8 7790.9 7817.2 4767.8 4837.6 4842.3 4844.4 4866.3 3050.6 3053.8 3116.1 3164.2 3178.4 960.8 964.4 966.5 979.2 1017.5 10850.6 10881.6 10927.8 10960.1 10964.9 4198.5 4215.2 4221.4 4237.2 4295.8 8872.0 8877.0 8877.1 8889.5 8929.3 4666.3 4674.9 4675.4 4687.4 4702.6 4340.7 4351.7 4360.7 4379.8 4383.6 3488.1 3501.2 3505.5 3519.0 3533.3 1062.0 1081.7 1082.4 1084.3 1087.6 979.0 984.6 1017.6 1020.4 1021.8 7173.2 7201.1 7214.0 7319.3 7320.2 621.0 627.8 643.1 644.1 774.4 5635.8 5673.9 5706.3 5707.3 5720.1 8321.6 8516.1 8707.5 9007.2 9117.8 8893.8 8942.5 8958.0 8991.0 9036.5 6960.1 7070.0 7110.0 7111.5 7131.6 6829.7 6879.9 6905.0 6916.7 6935.6 7928.7 7979.4 8108.8 8135.2 8185.2 8176.8 8207.4 8290.7 8315.4 8325.2 6329.7 6332.5 6337.6 6402.9 6466.6 7072.0 7116.0 7163.0 7178.0 7189.2 6859.5 6945.4 6954.3 7055.0 7069.0 6338.6 6370.5 6740.0 6841.9 6931.2 6951.2 6971.8 6978.4 6984.0 7018.9 6456.7 6469.4 6499.4 6504.9 6522.2 6430.1 6564.6 6602.7 6607.1 6617.1 19:07:01 INFO - PROCESS | 30544 | 19:07:01 INFO - PROCESS | 30544 | [#4] prototype.html Cycles:180 Average:5544.92 Median:6243.95 stddev:1664.16 (26.7%) stddev-sans-first:1622.43 19:07:01 INFO - PROCESS | 30544 | Values: 345.4 351.3 354.5 355.3 358.3 6221.8 6243.3 6287.8 6336.3 6398.4 6239.7 6266.4 6279.6 6284.2 6287.8 4766.5 4782.9 4805.8 4808.3 4818.1 4817.8 4817.8 4821.4 4824.4 4841.7 4680.2 4766.4 4780.9 4796.1 4808.0 4763.4 4763.8 4764.2 4770.6 4787.7 4157.9 4172.3 4175.6 4180.1 4186.7 5913.7 5946.8 5950.9 5967.9 5974.3 5482.7 5615.7 5620.4 5628.8 5644.8 6703.1 6705.6 6712.4 6715.2 6715.8 4622.1 4623.0 4642.1 4642.5 4657.6 6792.3 6847.1 6871.8 6895.5 6923.2 4642.5 4649.3 4695.2 4711.8 4726.8 4749.1 4758.4 4762.5 4763.4 4773.8 5534.3 5537.0 5546.5 5564.5 5585.5 6589.1 6692.2 6700.3 6702.1 6742.7 1643.0 1675.3 1682.7 1685.2 1690.8 1122.2 1124.5 1132.7 1135.7 1140.8 6170.2 6223.9 6237.5 6238.6 6255.3 6800.2 6805.9 6809.0 6820.3 6823.5 6078.5 6183.1 6217.8 6224.8 6244.6 3683.9 3686.2 3686.4 3690.1 3696.9 7001.6 7030.1 7059.8 7065.8 7068.2 6688.2 6854.3 6880.1 6922.1 6945.1 6982.2 7001.7 7021.4 7032.5 7048.7 6724.1 6756.8 6760.8 6776.2 6778.5 6599.6 6636.3 6696.3 6713.4 6738.9 6905.8 7010.7 7016.8 7032.6 7044.8 4634.9 4661.4 4682.3 4690.5 4691.8 6673.7 6683.7 6685.5 6764.3 6893.0 6742.3 6790.9 6799.5 6815.2 6835.5 6649.9 6687.7 6693.7 6705.0 6707.9 6448.1 6542.2 6559.1 6571.5 6608.8 6765.0 6765.6 6776.0 6786.8 6793.4 6582.0 6582.5 6628.8 6634.2 6639.9 19:07:01 INFO - PROCESS | 30544 | 19:07:01 INFO - PROCESS | 30544 | [#5] yui.html Cycles:180 Average:13019.58 Median:45145.05 stddev:14818.47 (32.8%) stddev-sans-first:14831.00 19:07:01 INFO - PROCESS | 30544 | Values: 664.7 671.2 717.4 721.9 727.4 12611.9 12815.7 12939.7 12960.2 12971.3 11575.7 11618.1 11843.9 13252.9 13479.9 794.7 807.9 808.3 809.0 809.0 795.8 815.0 817.3 821.1 821.2 846.4 847.7 852.0 856.8 857.1 845.4 850.0 851.0 853.7 854.7 622.2 623.7 625.2 627.5 628.8 13120.9 13176.3 13192.0 13214.7 13224.9 11097.5 11160.4 11296.3 11552.6 11739.1 10361.5 10524.1 10575.2 10578.9 10599.7 4138.1 4154.3 4212.1 4248.2 4353.6 45096.8 45193.3 45600.8 45884.3 46075.3 9235.3 9424.4 9532.7 9549.9 9693.0 16716.8 16746.6 16756.6 16826.3 16835.4 7105.7 7326.2 7365.2 7433.6 7462.4 4338.9 4352.6 4372.3 4377.0 4384.5 3051.3 3061.3 3083.8 3093.8 3095.3 530.4 543.8 545.2 545.3 545.9 524.6 563.5 640.4 650.7 698.3 8426.3 8459.6 8465.8 8616.1 9020.7 540.1 589.9 594.7 652.4 697.1 3713.9 3809.9 3843.1 3949.4 3978.0 52577.5 53722.7 54571.7 54661.7 54693.5 46073.3 46860.5 46874.3 47723.3 47731.3 42542.6 43239.1 43321.0 43773.8 43890.0 8062.2 8210.0 8393.9 8464.1 8525.4 31560.7 31878.4 32031.7 32088.2 32348.5 40557.0 41092.2 41687.2 41846.9 42633.8 10582.4 10593.6 10616.8 10827.6 11128.9 10673.0 10744.7 10946.5 10956.6 11148.7 10779.9 10781.6 10856.7 10903.2 11006.2 10909.9 10959.7 11032.8 11113.8 11432.2 10020.2 10322.5 10393.9 10699.1 10965.9 8630.8 8790.9 8873.8 8953.5 9194.7 8988.1 9186.0 9462.6 9619.4 9740.9 19:07:01 INFO - PROCESS | 30544 | -------- Summary: end -------- 19:07:01 INFO - PROCESS | 30544 | 19:07:02 INFO - TEST-INFO | 30544: exit 0 19:07:02 INFO - TEST-OK | dromaeo_css | took 1110671ms 19:07:02 INFO - TEST-START | kraken 19:07:02 INFO - operating with platform_type : linux_ 19:07:02 INFO - Initialising browser for kraken test... 19:07:02 INFO - TEST-INFO | started process 30785 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpomi7xU/profile http://localhost:45156/getInfo.html) 19:07:05 INFO - PROCESS | 30785 | 19:07:05 INFO - PROCESS | 30785 | (process:30858): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 19:07:06 INFO - PROCESS | 30785 | __metrics Screen width/height:1600/1200 19:07:06 INFO - PROCESS | 30785 | colorDepth:24 19:07:06 INFO - PROCESS | 30785 | Browser inner width/height: 1024/697 19:07:06 INFO - PROCESS | 30785 | __metrics 19:07:06 INFO - PROCESS | 30785 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 19:07:07 INFO - TEST-INFO | 30785: exit 0 19:07:07 INFO - Browser initialized. 19:07:07 INFO - Running cycle 1/1 for kraken test... 19:07:07 INFO - TEST-INFO | started process 30907 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpomi7xU/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:07:08 INFO - PROCESS | 30907 | 19:07:08 INFO - PROCESS | 30907 | (process:30964): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 19:07:19 INFO - PROCESS | 30907 | RSS: Main: 150675456 19:07:19 INFO - PROCESS | 30907 | 19:07:21 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:45156/tests/kraken/driver.html?testName=audio-beat-detection) 19:07:22 INFO - PROCESS | 30907 | RSS: Main: 154918912 19:07:22 INFO - PROCESS | 30907 | 19:07:25 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:45156/tests/kraken/driver.html?testName=audio-dft) 19:07:25 INFO - PROCESS | 30907 | RSS: Main: 158216192 19:07:25 INFO - PROCESS | 30907 | 19:07:28 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:45156/tests/kraken/driver.html?testName=audio-fft) 19:07:29 INFO - PROCESS | 30907 | RSS: Main: 151830528 19:07:29 INFO - PROCESS | 30907 | 19:07:31 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:45156/tests/kraken/driver.html?testName=audio-oscillator) 19:07:32 INFO - PROCESS | 30907 | RSS: Main: 152592384 19:07:32 INFO - PROCESS | 30907 | 19:07:34 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:45156/tests/kraken/driver.html?testName=imaging-gaussian-blur) 19:07:34 INFO - PROCESS | 30907 | RSS: Main: 153055232 19:07:34 INFO - PROCESS | 30907 | 19:07:37 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:45156/tests/kraken/driver.html?testName=imaging-darkroom) 19:07:38 INFO - PROCESS | 30907 | RSS: Main: 151998464 19:07:38 INFO - PROCESS | 30907 | 19:07:41 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:45156/tests/kraken/driver.html?testName=imaging-desaturate) 19:07:42 INFO - PROCESS | 30907 | RSS: Main: 152727552 19:07:42 INFO - PROCESS | 30907 | 19:07:45 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:45156/tests/kraken/driver.html?testName=json-parse-financial) 19:07:45 INFO - PROCESS | 30907 | RSS: Main: 154632192 19:07:45 INFO - PROCESS | 30907 | 19:07:47 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:45156/tests/kraken/driver.html?testName=json-stringify-tinderbox) 19:07:47 INFO - PROCESS | 30907 | RSS: Main: 154734592 19:07:47 INFO - PROCESS | 30907 | 19:07:49 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:45156/tests/kraken/driver.html?testName=stanford-crypto-aes) 19:07:50 INFO - PROCESS | 30907 | RSS: Main: 153735168 19:07:50 INFO - PROCESS | 30907 | 19:07:52 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:45156/tests/kraken/driver.html?testName=stanford-crypto-ccm) 19:07:53 INFO - PROCESS | 30907 | RSS: Main: 153726976 19:07:53 INFO - PROCESS | 30907 | 19:07:55 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:45156/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 19:07:56 INFO - PROCESS | 30907 | RSS: Main: 153726976 19:07:56 INFO - PROCESS | 30907 | 19:07:58 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:45156/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 19:07:59 INFO - PROCESS | 30907 | RSS: Main: 155611136 19:07:59 INFO - PROCESS | 30907 | 19:08:00 INFO - PROCESS | 30907 | Cycle 1(1): loaded http://localhost:45156/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:45156/tests/kraken/driver.html?testName=ai-astar) 19:08:01 INFO - PROCESS | 30907 | RSS: Main: 155017216 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | __start_tp_report 19:08:01 INFO - PROCESS | 30907 | _x_x_mozilla_page_load 19:08:01 INFO - PROCESS | 30907 | _x_x_mozilla_page_load_details 19:08:01 INFO - PROCESS | 30907 | |i|pagename|runs| 19:08:01 INFO - PROCESS | 30907 | |0;ai-astar;111;108;111;110;111;131;110;111;111;110 19:08:01 INFO - PROCESS | 30907 | |1;audio-beat-detection;155;132;153;168;135;174;158;131;178;128 19:08:01 INFO - PROCESS | 30907 | |2;audio-dft;161;162;163;161;163;161;162;164;165;163 19:08:01 INFO - PROCESS | 30907 | |3;audio-fft;74;74;73;74;74;74;140;75;77;73 19:08:01 INFO - PROCESS | 30907 | |4;audio-oscillator;97;97;149;97;97;97;142;97;95;144 19:08:01 INFO - PROCESS | 30907 | |5;imaging-gaussian-blur;110;112;111;110;110;110;110;109;109;110 19:08:01 INFO - PROCESS | 30907 | |6;imaging-darkroom;146;146;146;148;147;146;146;147;145;147 19:08:01 INFO - PROCESS | 30907 | |7;imaging-desaturate;97;97;96;98;96;98;96;97;96;97 19:08:01 INFO - PROCESS | 30907 | |8;json-parse-financial;63;58;63;61;60;60;59;62;67;57 19:08:01 INFO - PROCESS | 30907 | |9;json-stringify-tinderbox;67;68;73;67;68;67;68;69;69;69 19:08:01 INFO - PROCESS | 30907 | |10;stanford-crypto-aes;82;81;91;84;82;83;81;84;83;86 19:08:01 INFO - PROCESS | 30907 | |11;stanford-crypto-ccm;120;121;122;113;113;122;121;114;116;115 19:08:01 INFO - PROCESS | 30907 | |12;stanford-crypto-pbkdf2;136;142;148;140;145;143;139;141;142;129 19:08:01 INFO - PROCESS | 30907 | |13;stanford-crypto-sha256-iterative;67;72;66;69;67;69;68;67;68;66 19:08:01 INFO - PROCESS | 30907 | __end_tp_report 19:08:01 INFO - PROCESS | 30907 | __start_cc_report 19:08:01 INFO - PROCESS | 30907 | _x_x_mozilla_cycle_collect,736 19:08:01 INFO - PROCESS | 30907 | __end_cc_report 19:08:01 INFO - PROCESS | 30907 | __startTimestamp1453691281100__endTimestamp 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | ------- Summary: start ------- 19:08:01 INFO - PROCESS | 30907 | Number of tests: 14 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#0] ai-astar Cycles:10 Average:112.40 Median:111.00 stddev:6.60 (5.9%) stddev-sans-first:6.98 19:08:01 INFO - PROCESS | 30907 | Values: 111.0 108.0 111.0 110.0 111.0 131.0 110.0 111.0 111.0 110.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#1] audio-beat-detection Cycles:10 Average:151.20 Median:156.50 stddev:18.74 (12.0%) stddev-sans-first:19.83 19:08:01 INFO - PROCESS | 30907 | Values: 155.0 132.0 153.0 168.0 135.0 174.0 158.0 131.0 178.0 128.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#2] audio-dft Cycles:10 Average:162.50 Median:163.00 stddev:1.35 (0.8%) stddev-sans-first:1.32 19:08:01 INFO - PROCESS | 30907 | Values: 161.0 162.0 163.0 161.0 163.0 161.0 162.0 164.0 165.0 163.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#3] audio-fft Cycles:10 Average:80.80 Median:74.00 stddev:20.83 (28.2%) stddev-sans-first:21.95 19:08:01 INFO - PROCESS | 30907 | Values: 74.0 74.0 73.0 74.0 74.0 74.0 140.0 75.0 77.0 73.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#4] audio-oscillator Cycles:10 Average:111.20 Median:97.00 stddev:23.39 (24.1%) stddev-sans-first:24.24 19:08:01 INFO - PROCESS | 30907 | Values: 97.0 97.0 149.0 97.0 97.0 97.0 142.0 97.0 95.0 144.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#5] imaging-gaussian-blur Cycles:10 Average:110.10 Median:110.00 stddev:0.88 (0.8%) stddev-sans-first:0.93 19:08:01 INFO - PROCESS | 30907 | Values: 110.0 112.0 111.0 110.0 110.0 110.0 110.0 109.0 109.0 110.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#6] imaging-darkroom Cycles:10 Average:146.40 Median:146.50 stddev:0.84 (0.6%) stddev-sans-first:0.88 19:08:01 INFO - PROCESS | 30907 | Values: 146.0 146.0 146.0 148.0 147.0 146.0 146.0 147.0 145.0 147.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#7] imaging-desaturate Cycles:10 Average:96.80 Median:97.00 stddev:0.79 (0.8%) stddev-sans-first:0.83 19:08:01 INFO - PROCESS | 30907 | Values: 97.0 97.0 96.0 98.0 96.0 98.0 96.0 97.0 96.0 97.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#8] json-parse-financial Cycles:10 Average:61.00 Median:61.50 stddev:2.91 (4.7%) stddev-sans-first:2.99 19:08:01 INFO - PROCESS | 30907 | Values: 63.0 58.0 63.0 61.0 60.0 60.0 59.0 62.0 67.0 57.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#9] json-stringify-tinderbox Cycles:10 Average:68.50 Median:68.50 stddev:1.78 (2.6%) stddev-sans-first:1.80 19:08:01 INFO - PROCESS | 30907 | Values: 67.0 68.0 73.0 67.0 68.0 67.0 68.0 69.0 69.0 69.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#10] stanford-crypto-aes Cycles:10 Average:83.70 Median:83.50 stddev:2.98 (3.6%) stddev-sans-first:3.10 19:08:01 INFO - PROCESS | 30907 | Values: 82.0 81.0 91.0 84.0 82.0 83.0 81.0 84.0 83.0 86.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#11] stanford-crypto-ccm Cycles:10 Average:117.70 Median:120.50 stddev:3.83 (3.2%) stddev-sans-first:3.97 19:08:01 INFO - PROCESS | 30907 | Values: 120.0 121.0 122.0 113.0 113.0 122.0 121.0 114.0 116.0 115.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:140.50 Median:142.00 stddev:5.19 (3.7%) stddev-sans-first:5.24 19:08:01 INFO - PROCESS | 30907 | Values: 136.0 142.0 148.0 140.0 145.0 143.0 139.0 141.0 142.0 129.0 19:08:01 INFO - PROCESS | 30907 | 19:08:01 INFO - PROCESS | 30907 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.90 Median:68.00 stddev:1.79 (2.6%) stddev-sans-first:1.87 19:08:01 INFO - PROCESS | 30907 | Values: 67.0 72.0 66.0 69.0 67.0 69.0 68.0 67.0 68.0 66.0 19:08:01 INFO - PROCESS | 30907 | -------- Summary: end -------- 19:08:01 INFO - PROCESS | 30907 | 19:08:02 INFO - TEST-INFO | 30907: exit 0 19:08:02 INFO - TEST-OK | kraken | took 59985ms 19:08:02 INFO - TEST-START | v8_7 19:08:02 INFO - operating with platform_type : linux_ 19:08:02 INFO - Initialising browser for v8_7 test... 19:08:02 INFO - TEST-INFO | started process 31192 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpo7FGZK/profile http://localhost:45156/getInfo.html) 19:08:05 INFO - PROCESS | 31192 | 19:08:05 INFO - PROCESS | 31192 | (process:31260): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 19:08:06 INFO - PROCESS | 31192 | __metrics Screen width/height:1600/1200 19:08:06 INFO - PROCESS | 31192 | colorDepth:24 19:08:06 INFO - PROCESS | 31192 | Browser inner width/height: 1024/697 19:08:06 INFO - PROCESS | 31192 | __metrics 19:08:06 INFO - PROCESS | 31192 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 19:08:07 INFO - TEST-INFO | 31192: exit 0 19:08:07 INFO - Browser initialized. 19:08:07 INFO - Running cycle 1/1 for v8_7 test... 19:08:07 INFO - TEST-INFO | started process 31309 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpo7FGZK/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:08:08 INFO - PROCESS | 31309 | 19:08:08 INFO - PROCESS | 31309 | (process:31366): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 19:08:19 INFO - PROCESS | 31309 | RSS: Main: 150487040 19:08:19 INFO - PROCESS | 31309 | 19:08:41 INFO - PROCESS | 31309 | Cycle 1(1): loaded http://localhost:45156/tests/v8_7/run.html (next: http://localhost:45156/tests/v8_7/run.html) 19:08:42 INFO - PROCESS | 31309 | RSS: Main: 152018944 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - PROCESS | 31309 | __start_tp_report 19:08:42 INFO - PROCESS | 31309 | _x_x_mozilla_page_load 19:08:42 INFO - PROCESS | 31309 | _x_x_mozilla_page_load_details 19:08:42 INFO - PROCESS | 31309 | |i|pagename|runs| 19:08:42 INFO - PROCESS | 31309 | |0;Richards;167.9261125104954 19:08:42 INFO - PROCESS | 31309 | |1;DeltaBlue;190.15021867275146 19:08:42 INFO - PROCESS | 31309 | |2;Encrypt;279.6420581655481 19:08:42 INFO - PROCESS | 31309 | |3;Decrypt;5208.333333333333 19:08:42 INFO - PROCESS | 31309 | |4;RayTrace;1071.8113612004288 19:08:42 INFO - PROCESS | 31309 | |5;Earley;710.7320540156361 19:08:42 INFO - PROCESS | 31309 | |6;Boyer;12550 19:08:42 INFO - PROCESS | 31309 | |7;RegExp;41102.04081632653 19:08:42 INFO - PROCESS | 31309 | |8;Splay;580.046403712297 19:08:42 INFO - PROCESS | 31309 | |9;NavierStokes;4840.579710144928 19:08:42 INFO - PROCESS | 31309 | __end_tp_report 19:08:42 INFO - PROCESS | 31309 | __startTimestamp1453691322020__endTimestamp 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - PROCESS | 31309 | ------- Summary: start ------- 19:08:42 INFO - PROCESS | 31309 | Number of tests: 10 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - PROCESS | 31309 | [#0] Richards Cycles:1 Average:167.93 Median:167.93 stddev:0.00 (0.0%) 19:08:42 INFO - PROCESS | 31309 | Values: 167.9 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - PROCESS | 31309 | [#1] DeltaBlue Cycles:1 Average:190.15 Median:190.15 stddev:0.00 (0.0%) 19:08:42 INFO - PROCESS | 31309 | Values: 190.2 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - PROCESS | 31309 | [#2] Encrypt Cycles:1 Average:279.64 Median:279.64 stddev:0.00 (0.0%) 19:08:42 INFO - PROCESS | 31309 | Values: 279.6 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - PROCESS | 31309 | [#3] Decrypt Cycles:1 Average:5208.33 Median:5208.33 stddev:0.00 (0.0%) 19:08:42 INFO - PROCESS | 31309 | Values: 5208.3 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - PROCESS | 31309 | [#4] RayTrace Cycles:1 Average:1071.81 Median:1071.81 stddev:0.00 (0.0%) 19:08:42 INFO - PROCESS | 31309 | Values: 1071.8 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - PROCESS | 31309 | [#5] Earley Cycles:1 Average:710.73 Median:710.73 stddev:0.00 (0.0%) 19:08:42 INFO - PROCESS | 31309 | Values: 710.7 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - PROCESS | 31309 | [#6] Boyer Cycles:1 Average:12550.00 Median:12550.00 stddev:0.00 (0.0%) 19:08:42 INFO - PROCESS | 31309 | Values: 12550.0 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - PROCESS | 31309 | [#7] RegExp Cycles:1 Average:41102.04 Median:41102.04 stddev:0.00 (0.0%) 19:08:42 INFO - PROCESS | 31309 | Values: 41102.0 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - PROCESS | 31309 | [#8] Splay Cycles:1 Average:580.05 Median:580.05 stddev:0.00 (0.0%) 19:08:42 INFO - PROCESS | 31309 | Values: 580.0 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - PROCESS | 31309 | [#9] NavierStokes Cycles:1 Average:4840.58 Median:4840.58 stddev:0.00 (0.0%) 19:08:42 INFO - PROCESS | 31309 | Values: 4840.6 19:08:42 INFO - PROCESS | 31309 | -------- Summary: end -------- 19:08:42 INFO - PROCESS | 31309 | 19:08:42 INFO - TEST-INFO | 31309: exit 0 19:08:42 INFO - TEST-OK | v8_7 | took 40706ms 19:08:42 INFO - SUITE-END | took 1211s 19:08:43 INFO - Completed test suite (00:20:11) 19:08:43 INFO - Working with test: dromaeo_css 19:08:43 INFO - Generating results file: dromaeo_css 19:08:43 INFO - Working with test: kraken 19:08:43 INFO - Generating results file: kraken 19:08:43 INFO - javascript benchmark 19:08:43 INFO - Working with test: v8_7 19:08:43 INFO - Generating results file: v8_7 19:08:43 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 19:08:43 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,63,43]] 19:08:43 INFO - process_Request line: dromaeo_css 6783.54 graph.html#tests=[[72,63,43]] 19:08:43 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 19:08:43 INFO - process_Request line: kraken 1510.70 graph.html#tests=[[232,63,43]] 19:08:43 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 19:08:43 INFO - process_Request line: v8_7 20374.49 graph.html#tests=[[230,63,43]] 19:08:43 INFO - RETURN: dromaeo_css: 6783.54 19:08:43 INFO - RETURN: kraken: 1510.70 19:08:43 INFO - RETURN: v8_7: 20374.49 19:08:43 INFO - javascript benchmark 19:08:43 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3186.028261380279, 3206.9679303206963, 3237.4172648923186, 3247.269364393012, 3255.3977514159883, 5248.370195576526, 5273.551748101411, 5289.788408463662, 5331.520163185312, 5338.786448542063, 5209.2707021016995, 5246.396664383597, 5267.0256002639535, 5319.946800531993, 5404.91892621611, 4757.381540399751, 4795.880102997418, 4840.661153719241, 4858.659893807435, 4914.140025495524, 4579.473360563545, 4893.632977526682, 4895.849475373302, 4933.901321973576, 4969.180085285923, 4751.691140075901, 4816.614670826326, 4857.951420485821, 4858.17411040124, 4941.160002799496, 4797.2564252540915, 4806.95193048072, 4809.615230781529, 4823.831165909211, 4841.685290456109, 4771.6421268404665, 4775.761211939423, 4776.188048031843, 4791.544803243686, 4820.542048505386, 5048.924266136011, 5103.157978933472, 5113.258577506278, 5178.223266510016, 5204.8178313758835, 5669.177969194444, 5697.658140511582, 5709.229254050691, 5727.914081288784, 5731.856703582402, 5670.744816483269, 5749.626274292157, 5751.0, 5758.6544807311275, 5762.250907382056, 5343.946560534384, 5409.810656626999, 5452.345718513804, 5459.454054594588, 5502.9174562381595, 5814.476697097281, 5815.331236907725, 5826.737796799154, 5833.620814647034, 5847.152162936351, 5478.863028424321, 5541.889162216814, 5599.1041433370465, 5620.0, 5622.550195984311, 5693.345265294544, 5746.080627099644, 5756.222909907193, 5764.654120752684, 5793.2179155814265, 5651.547876169897, 5664.631798933056, 5678.744456499468, 5687.061634830289, 5709.086546152679, 5554.389017208104, 5682.948654498931, 5686.658800471985, 5715.142728590745, 5735.856603584861, 4384.758838263862, 4389.517153113155, 4453.710508816916, 4516.187086324493, 4532.229520981441, 3970.9205815884097, 3973.046468847456, 3974.900627484278, 3999.3601023836627, 4006.719529632956, 5366.7048312343195, 5394.352677678704, 5398.109311963561, 5398.757055932492, 5419.783208671688, 5630.97184514083, 5696.231008813757, 5705.771769129271, 5717.628354156966, 5720.628159169641, 5374.785008599612, 5376.865578360494, 5377.542908852792, 5389.191621256843, 5428.022955867903, 4828.203346447796, 4858.78135483904, 4869.902601947942, 4871.488493708181, 4897.4857639948, 5766.913496297559, 5850.5027072699295, 5851.180834683148, 5858.2677165354335, 5889.646621202742, 5698.886022279614, 5700.629459085146, 5712.857178570569, 5738.340090889601, 5743.942560574508, 5813.128030795415, 5880.764769409176, 5899.970500147472, 5922.3485416605, 5931.703414829328, 5597.580181486486, 5632.549396048388, 5663.490285874291, 5684.317881854038, 5702.429757024264, 5734.627249228787, 5737.91393129095, 5740.282464691913, 5760.855978600569, 5765.625234359753, 5568.9443105568425, 5571.331440227199, 5576.749046292845, 5618.438156184349, 5677.858053548694, 5637.915431268452, 5655.632383895034, 5669.461401166883, 5683.147527870852, 5731.828045158652, 5537.861553461195, 5546.861328466821, 5572.60991730575, 5581.944180558143, 5584.106542953108, 5556.305461817273, 5590.692511911884, 5594.188842617717, 5649.971750141223, 5654.604177707685, 5534.0, 5560.860978475571, 5569.248151499658, 5594.104943209067, 5620.0], "unit": "score", "name": "dojo.html", "value": 5269.706931400747}, {"lowerIsBetter": false, "replicates": [532.1379365428007, 532.5313723922948, 532.904077266092, 552.7125894534842, 579.7825815319255, 35211.47182792257, 35836.10409739755, 36075.0, 36101.81949090251, 36128.27743445136, 39271.41092883609, 39550.80224598873, 39568.60431395685, 39570.8021459893, 39701.40447893284, 8435.70475033374, 8515.23362897339, 8519.616617252208, 8631.654733810672, 8647.221750042494, 8255.752327430157, 8387.329013678922, 8442.535660538668, 8444.324454043692, 8455.365847561427, 8240.752777416657, 8318.792030199233, 8369.916300837005, 8385.035720892114, 8391.95804020979, 8551.529665868375, 8577.27093197079, 8672.8699069514, 8678.609462574199, 8680.522571258547, 8485.915140848574, 8585.356098292654, 8624.396292259482, 8627.352948528885, 8631.136886311382, 38412.23175536474, 38449.423258650866, 38768.0, 38829.805850970566, 38922.61077389218, 2922.006517783964, 3187.665295144023, 3228.515722641599, 3408.9659103409144, 3725.4411838224214, 29501.262468438246, 29593.400469689183, 29873.25316867074, 29996.250093747614, 30448.391032179454, 3423.96576034239, 3536.4341705327283, 3663.0, 3797.9810100949594, 3992.3612222044335, 258644.0, 259348.9999999981, 259719.0, 260522.0, 262207.0, 54936.45063549393, 54952.0, 55988.720056399456, 57823.0, 59385.10922336169, 51381.743091285054, 51642.483575163766, 51875.74062129741, 52023.47976520262, 52235.21647175295, 14107.576772696835, 14188.787168192486, 14260.215688137252, 14295.28523573817, 14330.928345358207, 11155.609553665583, 11184.217104802585, 11216.439178041066, 11289.379084150287, 11303.660890173307, 19105.7517237263, 19464.221431142596, 19548.55004956885, 19727.802721972883, 19758.50603734918, 7072.787816365517, 7257.564546127249, 7263.818404539928, 7280.708771649181, 7283.490155689157, 875.7329014650466, 891.64334266294, 911.5761171055359, 1023.2785885950387, 1045.451138152476, 25772.484550308887, 28588.14235572936, 28871.566926496118, 29019.41961160765, 29083.7091629081, 994.264244459095, 1057.5452555401098, 1063.4151216830712, 1067.3595842494442, 1156.0522151898767, 14429.639259018608, 14481.0, 14516.854831451761, 14765.926170369079, 14781.482648107265, 325290.0, 331016.0, 331345.0, 331923.0, 332748.0, 50456.0, 50534.24198637023, 50592.74703626458, 50821.23768143481, 50866.74566627143, 1300.3238316075588, 1302.3618426970907, 1310.1745900082888, 1327.1705184259838, 1333.093496422442, 24124.0, 24784.0, 24943.12699055597, 25052.749472505042, 25175.118870839433, 45904.0, 45910.0, 46249.537504624524, 46274.53725462702, 46505.302420464395, 300155.0, 302365.0, 302851.0, 304654.0, 305351.0, 32244.19389515281, 32509.837450812596, 32662.366881656297, 32883.671163289015, 33141.66858331386, 32191.0, 32558.674413255565, 32682.019539413857, 32857.0, 32891.0, 28147.71852281533, 28249.57625635658, 28266.0, 28600.57099143556, 28823.0, 28331.858340708164, 28995.710042900144, 29664.937894095434, 29999.700003000562, 30356.54465183068, 29088.56367154452, 29343.0, 29763.255918601342, 29798.25504362408, 29938.70061299359, 28676.42647147087, 32252.67747322497, 32539.34921301608, 32609.0, 32737.67262327346, 24775.50448991046, 32098.19754506156, 32140.357192856478, 32514.349713006082, 33244.0], "unit": "score", "name": "ext.html", "value": 17602.638286875852}, {"lowerIsBetter": false, "replicates": [363.47114947751027, 365.2293660376605, 366.41556717036326, 367.029207745513, 368.99631003689956, 15747.976381535193, 16322.183890805456, 16873.915630421863, 17091.999999999985, 17512.649747005053, 14792.18642974636, 14818.55544333669, 15313.004654697437, 15650.217489125527, 15756.606084847856, 4716.834910778132, 5002.424721157077, 5005.54950054495, 5006.098902197603, 5016.021875734234, 4374.212641724488, 4708.246680531116, 4825.638077144211, 4917.4836642152595, 4983.800647974077, 4947.876303092416, 5008.048470790538, 5016.046951079284, 5161.509656582619, 5162.948370516285, 4553.544645535453, 5093.261477085839, 5144.202648589456, 5156.458571849958, 5513.448655134454, 5281.181416880389, 5283.445238249967, 5288.444713305086, 5293.179557168645, 5311.468853114697, 13042.804357934638, 19046.80953190464, 19875.403737887886, 19897.403077907686, 20005.699914501292, 2058.084152552115, 2072.575122099966, 2122.4375540481783, 2179.259051922354, 2184.7378314602192, 8808.823823523559, 10302.433366164858, 11666.949974502335, 12556.309402982832, 12911.870881291161, 1776.8045514993341, 1780.235408782825, 1858.7118996555555, 1864.673682105626, 1882.218879165145, 51945.99999999962, 52742.0, 53398.466015339734, 53497.0, 56607.0, 9500.619975201053, 9982.401055936522, 10228.948855255676, 10231.846522302172, 10327.638532651321, 13523.797143042862, 13574.25341606221, 13630.93184534071, 13631.727365452834, 13691.931540342433, 7478.700851965969, 7525.059367579052, 7532.17146113927, 7560.546367217985, 7606.277403646644, 7121.928780712126, 7124.857502850017, 7129.572225666477, 7177.138743350727, 7190.856182876313, 4270.615644592001, 4400.031992961543, 4440.4671439427475, 4458.420405347284, 4535.092981403733, 1740.6692728381568, 1789.7762779652544, 1832.2854086906118, 1838.108517369075, 1856.8700190986772, 835.3985130705883, 917.8439665256923, 946.3044662173297, 963.3978415513905, 1057.677408390433, 14940.701185976219, 15880.682386352208, 16210.432634857723, 16220.51338459848, 16481.17594120289, 875.776676947387, 931.6413180925257, 1002.0580654185043, 1009.7122320138725, 1017.0015918719752, 9351.597260410857, 9604.183644390165, 9613.423194608346, 9615.51922403877, 9628.47043412619, 335441.0, 345278.0, 485365.0, 491229.0, 491457.0, 46122.0, 49943.0, 70000.0, 70849.6457517709, 75457.24542754612, 1091.1816137896578, 1099.8240281554754, 1124.4040658451033, 1151.3034614058543, 1168.5325869652206, 14881.0, 14887.47893823711, 15051.77422338644, 15134.167620780963, 15434.305456254271, 20019.898905560334, 20830.895845520674, 29439.969601063858, 33601.83199083989, 34258.314833703684, 42802.57197427986, 42987.570124298356, 43181.56818431775, 44427.0, 44759.55240447684, 6980.441564674916, 7270.563766174047, 7392.667329970272, 7412.777616671508, 7435.776926692208, 8914.286857051291, 10859.131269498579, 11034.613788517363, 11224.831627525431, 11403.0, 8600.311975041857, 8868.822623547621, 9052.411593246417, 9188.58651360677, 9303.72088837336, 9469.195118414736, 9627.374220675634, 10034.69895903124, 10075.09324160829, 10141.695749127539, 8953.552322383724, 9238.95380523093, 9738.561764720464, 9802.65690700822, 9975.750606234902, 7215.458840586872, 7330.120385553768, 7447.962760186165, 7497.737579184703, 7573.242675732383, 8101.878471823045, 8951.0, 9304.488253146143, 9375.859362109437, 9377.624895004396], "unit": "score", "name": "jquery.html", "value": 7951.458909785283}, {"lowerIsBetter": false, "replicates": [1192.6779769462246, 1193.832863399124, 1233.97532049359, 1709.4102534625558, 1716.9742453863187, 7498.662560184791, 7693.422993275506, 7695.307422331989, 7880.054393472784, 7906.881396779046, 7652.1582625911105, 7676.923230767705, 7736.690532378712, 7767.339776119023, 7773.7279195228175, 2356.2342238772426, 2374.9168779092734, 2379.4884099918513, 2382.297222319411, 2391.7369089400154, 2369.5853225685523, 2375.821813364005, 2428.380762905457, 2436.2569416328015, 2437.0982736387473, 2068.327793467122, 2101.8528702990798, 2305.976940230593, 2389.390705370128, 2409.2170044735444, 2248.685184074223, 2260.977390226093, 2262.4457008032973, 2268.2174649745893, 2272.36373815332, 2285.645724912641, 2342.121704360865, 2352.047420794581, 2355.4464700795297, 2358.127492827665, 7758.728444504415, 7776.1057478389575, 7784.844303113906, 7790.922090779076, 7817.218278172138, 4767.833125840579, 4837.637177211688, 4842.32207490948, 4844.418669759616, 4866.31871537985, 3050.6186726659166, 3053.7709671774705, 3116.143060658337, 3164.161497203243, 3178.396104740092, 960.8366577681811, 964.4406244378243, 966.5457235099492, 979.1579241852002, 1017.4505766885873, 10850.565977360897, 10881.564737410574, 10927.781444371147, 10960.136776747971, 10964.945175274152, 4198.538160802309, 4215.241256573785, 4221.366794980778, 4237.194932962727, 4295.806688699016, 8871.955640221757, 8877.0, 8877.1122887712, 8889.511076890833, 8929.285657147413, 4666.253399456071, 4674.906501869944, 4675.392199014106, 4687.437507499122, 4702.623790096853, 4340.696151269444, 4351.6518678505645, 4360.738355698668, 4379.846705365297, 4383.583559561836, 3488.0582242794303, 3501.1947252132154, 3505.4741788731894, 3519.0322661268356, 3533.258015816656, 1061.984070238947, 1081.691717860406, 1082.4317233452343, 1084.3060441317564, 1087.597588892115, 978.9706308810747, 984.5520288268821, 1017.5878769098526, 1020.3622735790132, 1021.7701017271203, 7173.246809084971, 7201.063861697946, 7214.0, 7319.268073192638, 7320.1581818090535, 620.9751609935552, 627.8273474794468, 643.1381948189448, 644.127207633659, 774.4307933668749, 5635.830925072254, 5673.914891276634, 5706.343770466449, 5707.315122185364, 5720.11338242573, 8321.625526851307, 8516.06323304436, 8707.521086340186, 9007.189352958134, 9117.772055698528, 8893.822123557493, 8942.46345219289, 8958.0, 8990.955045224731, 9036.502992335485, 6960.129983752031, 7069.964650176819, 7110.0, 7111.53775004623, 7131.643417829087, 6829.6585170742255, 6879.862402751817, 6904.965475172592, 6916.688749006206, 6935.583864968118, 7928.722494712888, 7979.441439099207, 8108.75673729789, 8135.227153420416, 8185.181481851767, 8176.754697359089, 8207.425480216327, 8290.668373265002, 8315.376346773895, 8325.209105135002, 6329.683515824282, 6332.461740752087, 6337.588056776295, 6402.935970640234, 6466.644334561644, 7072.045273888165, 7116.0, 7163.0329905462095, 7177.964110179416, 7189.2451292615615, 6859.451243900576, 6945.374916257561, 6954.339337763106, 7054.964725176341, 7068.964655176691, 6338.58799178052, 6370.490360771035, 6740.0, 6841.863162736817, 6931.1682598088555, 6951.16586009682, 6971.790846274417, 6978.406835419046, 6983.9650801745665, 7018.859622807618, 6456.709448074754, 6469.3530646936815, 6499.350064993652, 6504.934950650433, 6522.15212022434, 6430.1319321892815, 6564.573302735307, 6602.735890564516, 6607.108040414482, 6617.139771829824], "unit": "score", "name": "mootools.html", "value": 4343.981423654214}, {"lowerIsBetter": false, "replicates": [345.4196949125469, 351.25358612947485, 354.5107751303201, 355.3266559869049, 358.3442300589921, 6221.844453888643, 6243.313235544087, 6287.779927702526, 6336.27132879719, 6398.3601639836, 6239.719212635431, 6266.436020758131, 6279.591826531284, 6284.245890493135, 6287.811365659026, 4766.451858036336, 4782.904341913159, 4805.831795887145, 4808.2547205183255, 4818.060478206751, 4817.759112044401, 4817.831375901844, 4821.445533763609, 4824.372831531896, 4841.709497430148, 4680.204365257914, 4766.428028636568, 4780.924292034282, 4796.064767370364, 4807.951920480803, 4763.404574428179, 4763.833265835697, 4764.213904705719, 4770.594499467549, 4787.688800228009, 4157.937630935538, 4172.269852775782, 4175.603317684815, 4180.080382315886, 4186.6859985500905, 5913.704314784243, 5946.762129514815, 5950.940490595125, 5967.910481342783, 5974.2830860297045, 5482.698451585161, 5615.747291371898, 5620.381758006616, 5628.831135065913, 5644.774209031634, 6703.095082163894, 6705.597664140168, 6712.429443497309, 6715.160604924385, 6715.764948226789, 4622.075584883003, 4623.0, 4642.117997580449, 4642.512536183686, 4657.6273898088075, 6792.252852186256, 6847.075644787989, 6871.797435448776, 6895.482838787061, 6923.169219693669, 4642.46611639659, 4649.325847752057, 4695.178343789823, 4711.8350857719815, 4726.787294571753, 4749.050189962021, 4758.405199350082, 4762.547557981986, 4763.3807605011125, 4773.76131193439, 5534.280543529316, 5537.0, 5546.528545073633, 5564.4713752193475, 5585.525230355384, 6589.077529145923, 6692.230393504809, 6700.329967003261, 6702.061711360413, 6742.662866856637, 1643.0388222889505, 1675.2796297591908, 1682.7055265328518, 1685.1995302231587, 1690.7971043474615, 1122.180808010157, 1124.4995976790412, 1132.660201939415, 1135.6536256441864, 1140.7775483780583, 6170.228721409824, 6223.906641400383, 6237.532185086136, 6238.563300569007, 6255.280642726054, 6800.217974932946, 6805.863882722417, 6809.0, 6820.31796820314, 6823.454123670094, 6078.483328917003, 6183.134361189437, 6217.751289948442, 6224.751009959641, 6244.594101383395, 3683.9263214735556, 3686.189038411545, 3686.3548878946076, 3690.132818787583, 3696.8521259149334, 7001.649917504104, 7030.121234845645, 7059.835127203954, 7065.752698655625, 7068.222495525488, 6688.230853451915, 6854.280300568468, 6880.071190389333, 6922.134733158356, 6945.062416573799, 6982.1970473395195, 7001.719931202695, 7021.403180729593, 7032.542884712478, 7048.682809273595, 6724.092247546519, 6756.763513277208, 6760.763373282109, 6776.186857577122, 6778.525503214925, 6599.571027883172, 6636.303188165173, 6696.296888826603, 6713.362230588086, 6738.932610674026, 6905.75829845953, 7010.68451919675, 7016.824579385352, 7032.6132062735, 7044.788656340318, 4634.86095417138, 4661.417322834645, 4682.2508398656055, 4690.530946905282, 4691.835785747482, 6673.733050677918, 6683.699233534599, 6685.498587605852, 6764.255931847394, 6892.965535172292, 6742.25835158142, 6790.8641827164165, 6799.456043516408, 6815.216250131299, 6835.487338449537, 6649.933500664932, 6687.699053542505, 6693.698783554654, 6705.0, 6707.899381509379, 6448.1295025171, 6542.247641521096, 6559.114519539801, 6571.507136964842, 6608.8347791305605, 6764.966175169093, 6765.560238584476, 6776.0, 6786.762463313958, 6793.388595026471, 6582.012698095133, 6582.506312026521, 6628.834279142867, 6634.203895532567, 6639.933600663931], "unit": "score", "name": "prototype.html", "value": 5003.721067764446}, {"lowerIsBetter": false, "replicates": [664.6743095883015, 671.2146788257738, 717.4009701898914, 721.920588735239, 727.4362369163894, 12611.936940315298, 12815.743685126316, 12939.741205175902, 12960.222386656807, 12971.28657923815, 11575.710607234823, 11618.128640351986, 11843.881561184386, 13252.867471325284, 13479.932600336984, 794.7099308752292, 807.9313258373045, 808.2806302390877, 808.9797755056142, 809.0291650019971, 795.8448102619991, 814.9837003259931, 817.2726273616486, 821.1049955548451, 821.2034326703089, 846.4286606540561, 847.7160151349306, 851.9701810436636, 856.755824589992, 857.1342943626919, 845.4335595151264, 849.9532525711084, 851.0383266908416, 853.7182729699215, 854.6709516836, 622.2222222222222, 623.6725718997517, 625.193500384508, 627.4697880291146, 628.8302158417248, 13120.868791312156, 13176.341182940814, 13192.0, 13214.735705285937, 13224.933875330562, 11097.500612472377, 11160.386178760165, 11296.265742726779, 11552.59565915189, 11739.06087512997, 10361.48192590375, 10524.052835244787, 10575.153987680967, 10578.947105264502, 10599.682009539727, 4138.110306284163, 4154.273002224599, 4212.115455754295, 4248.192843359751, 4353.564643535621, 45096.77451612754, 45193.32210016852, 45600.77199614014, 45884.311735323994, 46075.308870366636, 9235.261179105655, 9424.434533927986, 9532.666356677622, 9549.856752148584, 9692.951535242279, 16716.832831671527, 16746.58133546671, 16756.58108547296, 16826.326946922232, 16835.41076062332, 7105.680244389015, 7326.194118646945, 7365.189829118793, 7433.553986760811, 7462.365698915544, 4338.934915976263, 4352.564743525622, 4372.278574035248, 4376.978115109404, 4384.4519435070615, 3051.2829485070993, 3061.341811510536, 3083.799553029046, 3093.8453077346494, 3095.3190298134373, 530.4350866327349, 543.7553101104519, 545.1931141909995, 545.2720617974968, 545.868991442059, 524.635378412, 563.4703378823892, 640.3564417760122, 650.7299470719693, 698.27728301208, 8426.325893928593, 8459.577021148918, 8465.830683386297, 8616.052234254226, 9020.729378118667, 540.1330863963283, 589.8554854060783, 594.658071608818, 652.4421619515341, 697.0694123345289, 3713.925721485555, 3809.8857034289017, 3843.1160833008007, 3949.427333036751, 3977.960220397817, 52577.474225258025, 53722.73138634282, 54571.72714136404, 54661.72669136708, 54693.45306546963, 46073.30890036652, 46860.531394686295, 46874.29688554674, 47723.28415073777, 47731.28403073957, 42542.574574253864, 43239.13521729548, 43321.0, 43773.78113109478, 43890.0, 8062.234087761653, 8210.0, 8393.916060839314, 8464.068952415353, 8525.403221774417, 31560.684393156695, 31878.362432751677, 32031.67968320287, 32088.197795055312, 32348.514772277966, 40557.0, 41092.1781564373, 41687.1662566753, 41846.86148538932, 42633.78683106565, 10582.417967011888, 10593.629222977159, 10616.766081088464, 10827.621033263798, 11128.888711112786, 10673.0, 10744.677659670222, 10946.45267736594, 10956.616518421817, 11148.665540033811, 10779.946100269763, 10781.568737250422, 10856.728581785519, 10903.236773425784, 11006.174536909604, 10909.945450272699, 10959.726006849574, 11032.834507482556, 11113.777724445305, 11432.215253249387, 10020.248481364073, 10322.535485903303, 10393.948030260102, 10699.090577300705, 10965.945170274097, 8630.82738345217, 8790.912090879265, 8873.822523549621, 8953.462792232487, 9194.724158275263, 8988.10118988096, 9185.954070229605, 9462.621495140118, 9619.422834629944, 9740.853887191839], "unit": "score", "name": "yui.html", "value": 6077.273789190133}], "name": "dromaeo_css", "value": 6783.535717087834}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 108.0, 111.0, 110.0, 111.0, 131.0, 110.0, 111.0, 111.0, 110.0], "unit": "score", "name": "ai-astar", "value": 112.4}, {"lowerIsBetter": true, "replicates": [155.0, 132.0, 153.0, 168.0, 135.0, 174.0, 158.0, 131.0, 178.0, 128.0], "unit": "score", "name": "audio-beat-detection", "value": 151.2}, {"lowerIsBetter": true, "replicates": [161.0, 162.0, 163.0, 161.0, 163.0, 161.0, 162.0, 164.0, 165.0, 163.0], "unit": "score", "name": "audio-dft", "value": 162.5}, {"lowerIsBetter": true, "replicates": [74.0, 74.0, 73.0, 74.0, 74.0, 74.0, 140.0, 75.0, 77.0, 73.0], "unit": "score", "name": "audio-fft", "value": 80.8}, {"lowerIsBetter": true, "replicates": [97.0, 97.0, 149.0, 97.0, 97.0, 97.0, 142.0, 97.0, 95.0, 144.0], "unit": "score", "name": "audio-oscillator", "value": 111.2}, {"lowerIsBetter": true, "replicates": [110.0, 112.0, 111.0, 110.0, 110.0, 110.0, 110.0, 109.0, 109.0, 110.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 110.1}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 146.0, 148.0, 147.0, 146.0, 146.0, 147.0, 145.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 146.4}, {"lowerIsBetter": true, "replicates": [97.0, 97.0, 96.0, 98.0, 96.0, 98.0, 96.0, 97.0, 96.0, 97.0], "unit": "score", "name": "imaging-desaturate", "value": 96.8}, {"lowerIsBetter": true, "replicates": [63.0, 58.0, 63.0, 61.0, 60.0, 60.0, 59.0, 62.0, 67.0, 57.0], "unit": "score", "name": "json-parse-financial", "value": 61.0}, {"lowerIsBetter": true, "replicates": [67.0, 68.0, 73.0, 67.0, 68.0, 67.0, 68.0, 69.0, 69.0, 69.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.5}, {"lowerIsBetter": true, "replicates": [82.0, 81.0, 91.0, 84.0, 82.0, 83.0, 81.0, 84.0, 83.0, 86.0], "unit": "score", "name": "stanford-crypto-aes", "value": 83.7}, {"lowerIsBetter": true, "replicates": [120.0, 121.0, 122.0, 113.0, 113.0, 122.0, 121.0, 114.0, 116.0, 115.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 117.7}, {"lowerIsBetter": true, "replicates": [136.0, 142.0, 148.0, 140.0, 145.0, 143.0, 139.0, 141.0, 142.0, 129.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 140.5}, {"lowerIsBetter": true, "replicates": [67.0, 72.0, 66.0, 69.0, 67.0, 69.0, 68.0, 67.0, 68.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 67.9}], "name": "kraken", "value": 1510.7000000000003}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [167.9261125104954], "unit": "score", "name": "Richards", "value": 210.22340999999997}, {"lowerIsBetter": false, "replicates": [190.15021867275146], "unit": "score", "name": "DeltaBlue", "value": 347.714562}, {"lowerIsBetter": false, "replicates": [279.6420581655481], "unit": "score", "name": "Encrypt", "value": 951.8632560000003}, {"lowerIsBetter": false, "replicates": [5208.333333333333], "unit": "score", "name": "Decrypt", "value": 51.10675199999996}, {"lowerIsBetter": false, "replicates": [1071.8113612004288], "unit": "score", "name": "RayTrace", "value": 690.4097369999998}, {"lowerIsBetter": false, "replicates": [710.7320540156361], "unit": "score", "name": "Earley", "value": 937.7134409999999}, {"lowerIsBetter": false, "replicates": [12550.0], "unit": "score", "name": "Boyer", "value": 53.10462151394425}, {"lowerIsBetter": false, "replicates": [41102.04081632653], "unit": "score", "name": "RegExp", "value": 22.16398460774576}, {"lowerIsBetter": false, "replicates": [580.046403712297], "unit": "score", "name": "Splay", "value": 140.490484}, {"lowerIsBetter": false, "replicates": [4840.579710144928], "unit": "score", "name": "NavierStokes", "value": 306.5748502994012}], "name": "v8_7", "value": 20374.490005932836}]} 19:08:43 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,63,43]]", "result": "20374.49"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,63,43]]", "result": "1510.70"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,63,43]]", "result": "6783.54"}}} 19:08:43 INFO - Return code: 0 19:08:43 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 19:08:43 INFO - # TBPL SUCCESS # 19:08:43 INFO - Running post-action listener: _resource_record_post_action 19:08:43 INFO - Running post-run listener: _resource_record_post_run 19:08:44 INFO - Total resource usage - Wall time: 1229s; CPU: 13.0%; Read bytes: 16384; Write bytes: 561025024; Read time: 356; Write time: 475656 19:08:44 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 4096; Write bytes: 247275520; Read time: 200; Write time: 263296 19:08:44 INFO - run-tests - Wall time: 1213s; CPU: 13.0%; Read bytes: 12288; Write bytes: 313466880; Read time: 156; Write time: 212328 19:08:44 INFO - Running post-run listener: _upload_blobber_files 19:08:44 INFO - Blob upload gear active. 19:08:44 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 19:08:44 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 19:08:44 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'] 19:08:44 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 19:08:44 INFO - (blobuploader) - INFO - Open directory for files ... 19:08:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 19:08:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:08:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:08:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 19:08:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:08:45 INFO - (blobuploader) - INFO - Done attempting. 19:08:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 19:08:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:08:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:08:46 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 19:08:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:08:46 INFO - (blobuploader) - INFO - Done attempting. 19:08:46 INFO - (blobuploader) - INFO - Iteration through files over. 19:08:46 INFO - Return code: 0 19:08:46 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 19:08:46 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 19:08:46 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/869bb243ba987d4c75f7e27e851052e8513f769a2bed061e62d29f2e9d0079597eccd2a08eba233c32dc866a32409b9f83d9231938ccb95e5bf60d9726b4575e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/71cdc98efd6c30e78a17eab91fd306897ce3610d87be6fe77eb6c7d4ba8b96c414e9987dd155da7f665dfeee77c9c2c0e70ebde314e674649d7e68dd62d1d949"} 19:08:46 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 19:08:46 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 19:08:46 INFO - Contents: 19:08:46 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/869bb243ba987d4c75f7e27e851052e8513f769a2bed061e62d29f2e9d0079597eccd2a08eba233c32dc866a32409b9f83d9231938ccb95e5bf60d9726b4575e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/71cdc98efd6c30e78a17eab91fd306897ce3610d87be6fe77eb6c7d4ba8b96c414e9987dd155da7f665dfeee77c9c2c0e70ebde314e674649d7e68dd62d1d949"} 19:08:46 INFO - Running post-run listener: copy_logs_to_upload_dir 19:08:46 INFO - Copying logs to upload dir... 19:08:46 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 19:08:46 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1269.769977 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2016-01-24 19:08:46.527439) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-24 19:08:46.530756) ========= 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=652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/869bb243ba987d4c75f7e27e851052e8513f769a2bed061e62d29f2e9d0079597eccd2a08eba233c32dc866a32409b9f83d9231938ccb95e5bf60d9726b4575e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/71cdc98efd6c30e78a17eab91fd306897ce3610d87be6fe77eb6c7d4ba8b96c414e9987dd155da7f665dfeee77c9c2c0e70ebde314e674649d7e68dd62d1d949"} build_url:https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011604 build_url: 'https://queue.taskcluster.net/v1/task/Hrud-iqjTaGtlolHD8MR4g/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/869bb243ba987d4c75f7e27e851052e8513f769a2bed061e62d29f2e9d0079597eccd2a08eba233c32dc866a32409b9f83d9231938ccb95e5bf60d9726b4575e", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/71cdc98efd6c30e78a17eab91fd306897ce3610d87be6fe77eb6c7d4ba8b96c414e9987dd155da7f665dfeee77c9c2c0e70ebde314e674649d7e68dd62d1d949"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-24 19:08:46.556257) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 19:08:46.556608) ========= 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=652eb03db935cfc1c15ebda0000001ad-1453689654.328404-1032205317 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004485 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 19:08:46.639472) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-24 19:08:46.639822) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-24 19:08:46.640163) ========= ========= Total master_lag: 0.30 =========