builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-016 starttime: 1459527524.38 results: success (0) buildid: 20160401063253 builduid: bc536b55af404ec3a26cb5c3cfa1ab3e revision: 822429c7da5d82e1ec9a11986c2fa35105e01d01 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.378286) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.378713) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.379012) ========= 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=00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006346 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.401787) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.402074) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.416224) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.416515) ========= 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=00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004588 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.464926) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.465192) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.465558) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.465893) ========= 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=00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-01 09:18:44-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 89.4M=0s 2016-04-01 09:18:44 (89.4 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.159744 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.640141) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.640433) ========= 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=00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020568 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:44.689884) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-01 09:18:44.690190) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 822429c7da5d82e1ec9a11986c2fa35105e01d01 --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 822429c7da5d82e1ec9a11986c2fa35105e01d01 --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=00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-01 09:18:44,928 truncating revision to first 12 chars 2016-04-01 09:18:44,928 Setting DEBUG logging. 2016-04-01 09:18:44,928 attempt 1/10 2016-04-01 09:18:44,928 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/822429c7da5d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-01 09:18:45,931 unpacking tar archive at: mozilla-beta-822429c7da5d/testing/mozharness/ program finished with exit code 0 elapsedTime=1.314286 ========= master_lag: 0.06 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-01 09:18:46.066088) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:46.066451) ========= echo 822429c7da5d82e1ec9a11986c2fa35105e01d01 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'822429c7da5d82e1ec9a11986c2fa35105e01d01'] 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=00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 822429c7da5d82e1ec9a11986c2fa35105e01d01 program finished with exit code 0 elapsedTime=0.004840 script_repo_revision: '822429c7da5d82e1ec9a11986c2fa35105e01d01' ========= master_lag: 0.01 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:46.083750) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:46.084026) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-01 09:18:46.094138) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2016-04-01 09:18:46.094451) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 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-Beta', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] 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=00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 09:18:46 INFO - MultiFileLogger online at 20160401 09:18:46 in /builds/slave/test-pgo 09:18:46 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 09:18:46 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 09:18:46 INFO - {'append_to_log': False, 09:18:46 INFO - 'base_work_dir': '/builds/slave/test-pgo', 09:18:46 INFO - 'blob_upload_branch': 'Mozilla-Beta', 09:18:46 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 09:18:46 INFO - 'branch': 'Mozilla-Beta', 09:18:46 INFO - 'buildbot_json_path': 'buildprops.json', 09:18:46 INFO - 'config_files': ('talos/linux_config.py',), 09:18:46 INFO - 'default_actions': ('clobber', 09:18:46 INFO - 'read-buildbot-config', 09:18:46 INFO - 'download-and-extract', 09:18:46 INFO - 'populate-webroot', 09:18:46 INFO - 'create-virtualenv', 09:18:46 INFO - 'install', 09:18:46 INFO - 'run-tests'), 09:18:46 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:18:46 INFO - 'download_minidump_stackwalk': True, 09:18:46 INFO - 'download_symbols': 'ondemand', 09:18:46 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:18:46 INFO - 'tooltool.py': '/tools/tooltool.py', 09:18:46 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:18:46 INFO - '/tools/misc-python/virtualenv.py')}, 09:18:46 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:18:46 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:18:46 INFO - 'installer_path': 'installer.exe', 09:18:46 INFO - 'log_level': 'info', 09:18:46 INFO - 'log_name': 'talos', 09:18:46 INFO - 'log_to_console': True, 09:18:46 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 09:18:46 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 09:18:46 INFO - 'opt_config_files': (), 09:18:46 INFO - 'pip_index': False, 09:18:46 INFO - 'sps_profile': False, 09:18:46 INFO - 'sps_profile_interval': 0, 09:18:46 INFO - 'suite': 'dromaeojs-e10s', 09:18:46 INFO - 'system_bits': '32', 09:18:46 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:18:46 INFO - 'title': 'talos-linux64-ix-016', 09:18:46 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:18:46 INFO - 'use_talos_json': True, 09:18:46 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 09:18:46 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:18:46 INFO - 'work_dir': 'build'} 09:18:46 INFO - ##### 09:18:46 INFO - ##### Running clobber step. 09:18:46 INFO - ##### 09:18:46 INFO - Running pre-action listener: _resource_record_pre_action 09:18:46 INFO - Running main action method: clobber 09:18:46 INFO - rmtree: /builds/slave/test-pgo/build 09:18:46 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 09:18:47 INFO - Running post-action listener: _resource_record_post_action 09:18:47 INFO - ##### 09:18:47 INFO - ##### Running read-buildbot-config step. 09:18:47 INFO - ##### 09:18:47 INFO - Running pre-action listener: _resource_record_pre_action 09:18:47 INFO - Running main action method: read_buildbot_config 09:18:47 INFO - Using buildbot properties: 09:18:47 INFO - { 09:18:47 INFO - "project": "", 09:18:47 INFO - "product": "firefox", 09:18:47 INFO - "script_repo_revision": "production", 09:18:47 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s", 09:18:47 INFO - "repository": "", 09:18:47 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs-e10s", 09:18:47 INFO - "buildid": "20160401063253", 09:18:47 INFO - "pgo_build": "True", 09:18:47 INFO - "basedir": "/builds/slave/test-pgo", 09:18:47 INFO - "buildnumber": 33, 09:18:47 INFO - "slavename": "talos-linux64-ix-016", 09:18:47 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 09:18:47 INFO - "platform": "ubuntu64_hw", 09:18:47 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 09:18:47 INFO - "branch": "mozilla-beta", 09:18:47 INFO - "repo_path": "releases/mozilla-beta", 09:18:47 INFO - "revision": "822429c7da5d82e1ec9a11986c2fa35105e01d01", 09:18:47 INFO - "stage_platform": "linux64-pgo", 09:18:47 INFO - "builduid": "bc536b55af404ec3a26cb5c3cfa1ab3e", 09:18:47 INFO - "slavebuilddir": "test" 09:18:47 INFO - } 09:18:47 INFO - Found installer url https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2. 09:18:47 INFO - Running post-action listener: _resource_record_post_action 09:18:47 INFO - ##### 09:18:47 INFO - ##### Running download-and-extract step. 09:18:47 INFO - ##### 09:18:47 INFO - Running pre-action listener: _resource_record_pre_action 09:18:47 INFO - Running main action method: download_and_extract 09:18:47 INFO - mkdir: /builds/slave/test-pgo/build/tests 09:18: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')]} 09:18:47 INFO - https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 09:18:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/test_packages.json 09:18:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/test_packages.json 09:18:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 09:18:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 09:18:50 INFO - Downloaded 1412 bytes. 09:18:50 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 09:18:50 INFO - Using the following test package requirements: 09:18:50 INFO - {u'common': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip'], 09:18:50 INFO - u'cppunittest': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:18:50 INFO - u'firefox-46.0.en-US.linux-x86_64.cppunittest.tests.zip'], 09:18:50 INFO - u'gtest': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:18:50 INFO - u'firefox-46.0.en-US.linux-x86_64.gtest.tests.zip'], 09:18:50 INFO - u'jittest': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:18:50 INFO - u'jsshell-linux-x86_64.zip'], 09:18:50 INFO - u'mochitest': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:18:50 INFO - u'firefox-46.0.en-US.linux-x86_64.mochitest.tests.zip'], 09:18:50 INFO - u'mozbase': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip'], 09:18:50 INFO - u'reftest': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:18:50 INFO - u'firefox-46.0.en-US.linux-x86_64.reftest.tests.zip'], 09:18:50 INFO - u'talos': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:18:50 INFO - u'firefox-46.0.en-US.linux-x86_64.talos.tests.zip'], 09:18:50 INFO - u'web-platform': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:18:50 INFO - u'firefox-46.0.en-US.linux-x86_64.web-platform.tests.zip'], 09:18:50 INFO - u'webapprt': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip'], 09:18:50 INFO - u'xpcshell': [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', 09:18:50 INFO - u'firefox-46.0.en-US.linux-x86_64.xpcshell.tests.zip']} 09:18:50 INFO - Downloading packages: [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 09:18:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:18:50 INFO - https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 09:18:50 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip 09:18:50 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip 09:18:50 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip 09:18:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 09:18:56 INFO - Downloaded 23141073 bytes. 09:18:56 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 09:18:56 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 09:18:57 INFO - Return code: 0 09:18:57 INFO - Downloading packages: [u'firefox-46.0.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 09:18:57 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')]} 09:18:57 INFO - https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 09:18:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip 09:18:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip 09:18:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip 09:18:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 09:18:58 INFO - Downloaded 23141073 bytes. 09:18:58 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 09:18:58 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 09:19:00 INFO - Return code: 0 09:19:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:19:00 INFO - https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 09:19:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip 09:19:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip 09:19:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip 09:19:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 09:19:01 INFO - Downloaded 10801548 bytes. 09:19:01 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 09:19:01 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 09:19:01 INFO - Return code: 0 09:19: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')]} 09:19:01 INFO - https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 09:19:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 09:19:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 09:19:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 09:19:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.tar.bz2'}, attempt #1 09:19:02 INFO - Downloaded 52865810 bytes. 09:19:02 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 09:19:02 INFO - mkdir: /builds/slave/test-pgo/properties 09:19:02 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 09:19:02 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 09:19:02 INFO - Contents: 09:19:02 INFO - build_url:https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 09:19:03 INFO - Running post-action listener: _resource_record_post_action 09:19:03 INFO - Running post-action listener: set_extra_try_arguments 09:19:03 INFO - ##### 09:19:03 INFO - ##### Running populate-webroot step. 09:19:03 INFO - ##### 09:19:03 INFO - Running pre-action listener: _resource_record_pre_action 09:19:03 INFO - Running main action method: populate_webroot 09:19:03 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:19:03 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:19:03 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:19:03 INFO - '--tppagecycles', 09:19:03 INFO - '7'], 09:19:03 INFO - 'tests': ['tsvgm']}}, 09:19:03 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 09:19:03 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 09:19:03 INFO - 'tests': ['tresize', 'tcanvasmark']}, 09:19:03 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 09:19:03 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 09:19:03 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 09:19:03 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:19:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:19:03 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:19:03 INFO - 'talos_options': ['--e10s'], 09:19:03 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:19:03 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:19:03 INFO - 'tests': ['damp', 'tps']}, 09:19:03 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:19:03 INFO - 'talos_options': ['--e10s'], 09:19:03 INFO - 'tests': ['damp', 'tps']}, 09:19:03 INFO - 'g3': {'tests': ['dromaeo_dom']}, 09:19:03 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:19:03 INFO - 'other': {'tests': ['a11yr', 09:19:03 INFO - 'ts_paint', 09:19:03 INFO - 'tpaint', 09:19:03 INFO - 'sessionrestore', 09:19:03 INFO - 'sessionrestore_no_auto_restore']}, 09:19:03 INFO - 'other-e10s': {'talos_options': ['--e10s'], 09:19:03 INFO - 'tests': ['a11yr', 09:19:03 INFO - 'ts_paint', 09:19:03 INFO - 'tpaint', 09:19:03 INFO - 'sessionrestore', 09:19:03 INFO - 'sessionrestore_no_auto_restore']}, 09:19:03 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 09:19:03 INFO - 'tests': ['a11yr', 09:19:03 INFO - 'ts_paint', 09:19:03 INFO - 'tpaint', 09:19:03 INFO - 'sessionrestore', 09:19:03 INFO - 'sessionrestore_no_auto_restore']}, 09:19:03 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 09:19:03 INFO - 'tests': ['a11yr', 09:19:03 INFO - 'ts_paint', 09:19:03 INFO - 'tpaint', 09:19:03 INFO - 'sessionrestore', 09:19:03 INFO - 'sessionrestore_no_auto_restore']}, 09:19:03 INFO - 'other_l64': {'tests': ['a11yr', 09:19:03 INFO - 'ts_paint', 09:19:03 INFO - 'tpaint', 09:19:03 INFO - 'sessionrestore', 09:19:03 INFO - 'sessionrestore_no_auto_restore']}, 09:19:03 INFO - 'other_nol64': {'tests': ['a11yr', 09:19:03 INFO - 'ts_paint', 09:19:03 INFO - 'tpaint', 09:19:03 INFO - 'sessionrestore', 09:19:03 INFO - 'sessionrestore_no_auto_restore']}, 09:19:03 INFO - 'svgr': {'tests': ['tsvgx', 09:19:03 INFO - 'tsvgr_opacity', 09:19:03 INFO - 'tart', 09:19:03 INFO - 'tscrollx', 09:19:03 INFO - 'cart']}, 09:19:03 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 09:19:03 INFO - 'tests': ['tsvgx', 09:19:03 INFO - 'tsvgr_opacity', 09:19:03 INFO - 'tart', 09:19:03 INFO - 'tscrollx', 09:19:03 INFO - 'cart']}, 09:19:03 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:19:03 INFO - 'tests': ['tp5o']}, 09:19:03 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:19:03 INFO - 'talos_options': ['--e10s'], 09:19:03 INFO - 'tests': ['tp5o']}, 09:19:03 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:19:03 INFO - 'talos_options': ['--xperf_path', 09:19:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:19:03 INFO - 'tests': ['tp5n']}, 09:19:03 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:19:03 INFO - 'talos_options': ['--e10s', 09:19:03 INFO - '--xperf_path', 09:19:03 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:19:03 INFO - 'tests': ['tp5n']}}, 09:19:03 INFO - 'talos.zip': {'path': '', 09:19:03 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:19:03 INFO - Running post-action listener: _resource_record_post_action 09:19:03 INFO - ##### 09:19:03 INFO - ##### Running create-virtualenv step. 09:19:03 INFO - ##### 09:19:03 INFO - Running pre-action listener: _resource_record_pre_action 09:19:03 INFO - Running main action method: create_virtualenv 09:19:03 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 09:19:03 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 09:19:03 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 09:19:03 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:19:03 INFO - Using real prefix '/usr' 09:19:03 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 09:19:04 INFO - Installing distribute.............................................................................................................................................................................................done. 09:19:06 INFO - Installing pip.................done. 09:19:06 INFO - Return code: 0 09:19:06 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 09:19:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:19:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:19:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:06 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 0x7fcbb86b8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd018a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd0290>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe62850>, '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 0xdce330>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdce7c0>, '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': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', '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 09:19:06 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 09:19:06 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 09:19:06 INFO - Using env: {'DISPLAY': ':0', 09:19:06 INFO - 'HOME': '/home/cltbld', 09:19:06 INFO - 'LANG': 'en_US.UTF-8', 09:19:06 INFO - 'LANGUAGE': 'en_US:en', 09:19:06 INFO - 'LOGNAME': 'cltbld', 09:19:06 INFO - 'MAIL': '/var/mail/cltbld', 09:19:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:06 INFO - 'MOZ_NO_REMOTE': '1', 09:19:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:06 INFO - 'NO_EM_RESTART': '1', 09:19:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:19:06 INFO - 'PWD': '/builds/slave/test-pgo', 09:19:06 INFO - 'SHELL': '/bin/bash', 09:19:06 INFO - 'SHLVL': '1', 09:19:06 INFO - 'TERM': 'linux', 09:19:06 INFO - 'TMOUT': '86400', 09:19:06 INFO - 'USER': 'cltbld', 09:19:06 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', 09:19:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:06 INFO - '_': '/tools/buildbot/bin/python'} 09:19:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:06 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 09:19:06 INFO - Cleaning up... 09:19:06 INFO - Return code: 0 09:19:06 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 09:19:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:19:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:19:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:06 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 0x7fcbb86b8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd018a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd0290>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe62850>, '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 0xdce330>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdce7c0>, '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': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', '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 09:19:06 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 09:19:06 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 09:19:06 INFO - Using env: {'DISPLAY': ':0', 09:19:06 INFO - 'HOME': '/home/cltbld', 09:19:06 INFO - 'LANG': 'en_US.UTF-8', 09:19:06 INFO - 'LANGUAGE': 'en_US:en', 09:19:06 INFO - 'LOGNAME': 'cltbld', 09:19:06 INFO - 'MAIL': '/var/mail/cltbld', 09:19:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:06 INFO - 'MOZ_NO_REMOTE': '1', 09:19:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:06 INFO - 'NO_EM_RESTART': '1', 09:19:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:19:06 INFO - 'PWD': '/builds/slave/test-pgo', 09:19:06 INFO - 'SHELL': '/bin/bash', 09:19:06 INFO - 'SHLVL': '1', 09:19:06 INFO - 'TERM': 'linux', 09:19:06 INFO - 'TMOUT': '86400', 09:19:06 INFO - 'USER': 'cltbld', 09:19:06 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', 09:19:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:06 INFO - '_': '/tools/buildbot/bin/python'} 09:19:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:06 INFO - Downloading/unpacking psutil>=0.7.1 09:19: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 09:19: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 09:19: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 09:19: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 09:19: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 09:19: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 09:19:08 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 09:19:08 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:19:08 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:19:08 INFO - Installing collected packages: psutil 09:19:08 INFO - Running setup.py install for psutil 09:19:08 INFO - building 'psutil._psutil_linux' extension 09:19:08 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 09:19:09 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 09:19:09 INFO - building 'psutil._psutil_posix' extension 09:19:09 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 09:19:09 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 09:19:09 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:19:09 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:19:09 INFO - Successfully installed psutil 09:19:09 INFO - Cleaning up... 09:19:09 INFO - Return code: 0 09:19:09 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 09:19:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:19:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:19:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:09 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 0x7fcbb86b8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd018a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd0290>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe62850>, '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 0xdce330>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdce7c0>, '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': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', '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 09:19:09 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 09:19:09 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 09:19:09 INFO - Using env: {'DISPLAY': ':0', 09:19:09 INFO - 'HOME': '/home/cltbld', 09:19:09 INFO - 'LANG': 'en_US.UTF-8', 09:19:09 INFO - 'LANGUAGE': 'en_US:en', 09:19:09 INFO - 'LOGNAME': 'cltbld', 09:19:09 INFO - 'MAIL': '/var/mail/cltbld', 09:19:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:09 INFO - 'MOZ_NO_REMOTE': '1', 09:19:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:09 INFO - 'NO_EM_RESTART': '1', 09:19:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:19:09 INFO - 'PWD': '/builds/slave/test-pgo', 09:19:09 INFO - 'SHELL': '/bin/bash', 09:19:09 INFO - 'SHLVL': '1', 09:19:09 INFO - 'TERM': 'linux', 09:19:09 INFO - 'TMOUT': '86400', 09:19:09 INFO - 'USER': 'cltbld', 09:19:09 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', 09:19:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:09 INFO - '_': '/tools/buildbot/bin/python'} 09:19:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:09 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 09:19:09 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 09:19:09 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 09:19:09 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 09:19:09 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 09:19:09 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 09:19:09 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 09:19:11 INFO - Downloading mozsystemmonitor-0.0.tar.gz 09:19:11 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:19:11 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 09:19:11 INFO - Installing collected packages: mozsystemmonitor 09:19:11 INFO - Running setup.py install for mozsystemmonitor 09:19:11 INFO - Successfully installed mozsystemmonitor 09:19:11 INFO - Cleaning up... 09:19:11 INFO - Return code: 0 09:19:11 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 09:19:11 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')]} 09:19:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:11 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')]} 09:19:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:11 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 0x7fcbb86b8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd018a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd0290>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe62850>, '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 0xdce330>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdce7c0>, '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': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', '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 09:19:11 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 09:19:11 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 09:19:11 INFO - Using env: {'DISPLAY': ':0', 09:19:11 INFO - 'HOME': '/home/cltbld', 09:19:11 INFO - 'LANG': 'en_US.UTF-8', 09:19:11 INFO - 'LANGUAGE': 'en_US:en', 09:19:11 INFO - 'LOGNAME': 'cltbld', 09:19:11 INFO - 'MAIL': '/var/mail/cltbld', 09:19:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:11 INFO - 'MOZ_NO_REMOTE': '1', 09:19:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:11 INFO - 'NO_EM_RESTART': '1', 09:19:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:19:11 INFO - 'PWD': '/builds/slave/test-pgo', 09:19:11 INFO - 'SHELL': '/bin/bash', 09:19:11 INFO - 'SHLVL': '1', 09:19:11 INFO - 'TERM': 'linux', 09:19:11 INFO - 'TMOUT': '86400', 09:19:11 INFO - 'USER': 'cltbld', 09:19:11 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', 09:19:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:11 INFO - '_': '/tools/buildbot/bin/python'} 09:19:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:12 INFO - Downloading/unpacking blobuploader==1.2.4 09:19: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 09:19: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 09:19: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 09:19: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 09:19: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 09:19: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 09:19:13 INFO - Downloading blobuploader-1.2.4.tar.gz 09:19:13 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:19:13 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:19: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 09:19: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 09:19: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 09:19: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 09:19: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 09:19: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 09:19:14 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 09:19:14 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:19:14 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 09:19:14 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 09:19:14 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 09:19:14 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 09:19:14 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 09:19:14 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 09:19:14 INFO - Downloading docopt-0.6.1.tar.gz 09:19:14 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 09:19:14 INFO - Installing collected packages: blobuploader, requests, docopt 09:19:14 INFO - Running setup.py install for blobuploader 09:19:14 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:19:14 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 09:19:14 INFO - Running setup.py install for requests 09:19:15 INFO - Running setup.py install for docopt 09:19:15 INFO - Successfully installed blobuploader requests docopt 09:19:15 INFO - Cleaning up... 09:19:15 INFO - Return code: 0 09:19:15 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 09:19:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:19:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:19:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:15 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 0x7fcbb86b8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd018a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd0290>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe62850>, '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 0xdce330>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdce7c0>, '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': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', '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 09:19:15 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 09:19:15 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 09:19:15 INFO - Using env: {'DISPLAY': ':0', 09:19:15 INFO - 'HOME': '/home/cltbld', 09:19:15 INFO - 'LANG': 'en_US.UTF-8', 09:19:15 INFO - 'LANGUAGE': 'en_US:en', 09:19:15 INFO - 'LOGNAME': 'cltbld', 09:19:15 INFO - 'MAIL': '/var/mail/cltbld', 09:19:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:15 INFO - 'MOZ_NO_REMOTE': '1', 09:19:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:15 INFO - 'NO_EM_RESTART': '1', 09:19:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:19:15 INFO - 'PWD': '/builds/slave/test-pgo', 09:19:15 INFO - 'SHELL': '/bin/bash', 09:19:15 INFO - 'SHLVL': '1', 09:19:15 INFO - 'TERM': 'linux', 09:19:15 INFO - 'TMOUT': '86400', 09:19:15 INFO - 'USER': 'cltbld', 09:19:15 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', 09:19:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:15 INFO - '_': '/tools/buildbot/bin/python'} 09:19:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 09:19:15 INFO - Running setup.py (path:/tmp/pip-NRyUW2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 09:19:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 09:19:15 INFO - Running setup.py (path:/tmp/pip-yPj64X-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 09:19:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 09:19:15 INFO - Running setup.py (path:/tmp/pip-6duw2j-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 09:19:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 09:19:15 INFO - Running setup.py (path:/tmp/pip-FPbJx9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 09:19:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 09:19:15 INFO - Running setup.py (path:/tmp/pip-FzAc4X-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 09:19:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 09:19:15 INFO - Running setup.py (path:/tmp/pip-AQ1E8L-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 09:19:15 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 09:19:15 INFO - Running setup.py (path:/tmp/pip-gomkFv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 09:19:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 09:19:16 INFO - Running setup.py (path:/tmp/pip-Vr7uRf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 09:19:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 09:19:16 INFO - Running setup.py (path:/tmp/pip-jpAwsZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 09:19:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 09:19:16 INFO - Running setup.py (path:/tmp/pip-1YCqss-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 09:19:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 09:19:16 INFO - Running setup.py (path:/tmp/pip-vZn1tZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 09:19:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 09:19:16 INFO - Running setup.py (path:/tmp/pip-e2RkiT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 09:19:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 09:19:16 INFO - Running setup.py (path:/tmp/pip-5Wmsoc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 09:19:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 09:19:16 INFO - Running setup.py (path:/tmp/pip-muzT37-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 09:19:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 09:19:16 INFO - Running setup.py (path:/tmp/pip-J0djcY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 09:19:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 09:19:16 INFO - Running setup.py (path:/tmp/pip-Zhre4V-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 09:19:16 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 09:19:16 INFO - Running setup.py (path:/tmp/pip-4WYQzq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 09:19:16 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:19:16 INFO - Running setup.py install for manifestparser 09:19:16 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 09:19:16 INFO - Running setup.py install for mozcrash 09:19:16 INFO - Running setup.py install for mozdebug 09:19:17 INFO - Running setup.py install for mozdevice 09:19:17 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 09:19:17 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 09:19:17 INFO - Running setup.py install for mozfile 09:19:17 INFO - Running setup.py install for mozhttpd 09:19:17 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 09:19:17 INFO - Running setup.py install for mozinfo 09:19:17 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 09:19:17 INFO - Running setup.py install for mozInstall 09:19:17 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 09:19:17 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 09:19:17 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 09:19:17 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 09:19:17 INFO - Running setup.py install for mozleak 09:19:17 INFO - Running setup.py install for mozlog 09:19:17 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 09:19:17 INFO - Running setup.py install for moznetwork 09:19:17 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 09:19:17 INFO - Running setup.py install for mozprocess 09:19:17 INFO - Running setup.py install for mozprofile 09:19:18 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 09:19:18 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 09:19:18 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 09:19:18 INFO - Running setup.py install for mozrunner 09:19:18 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 09:19:18 INFO - Running setup.py install for mozscreenshot 09:19:18 INFO - Running setup.py install for moztest 09:19:18 INFO - Running setup.py install for mozversion 09:19:18 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 09:19:18 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:19:18 INFO - Cleaning up... 09:19:18 INFO - Return code: 0 09:19:18 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 09:19:18 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')]} 09:19:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:18 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')]} 09:19:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:18 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 0x7fcbb86b8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd018a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd0290>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe62850>, '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 0xdce330>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdce7c0>, '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': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', '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 09:19:18 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 09:19:18 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 09:19:18 INFO - Using env: {'DISPLAY': ':0', 09:19:18 INFO - 'HOME': '/home/cltbld', 09:19:18 INFO - 'LANG': 'en_US.UTF-8', 09:19:18 INFO - 'LANGUAGE': 'en_US:en', 09:19:18 INFO - 'LOGNAME': 'cltbld', 09:19:18 INFO - 'MAIL': '/var/mail/cltbld', 09:19:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:18 INFO - 'MOZ_NO_REMOTE': '1', 09:19:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:18 INFO - 'NO_EM_RESTART': '1', 09:19:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:19:18 INFO - 'PWD': '/builds/slave/test-pgo', 09:19:18 INFO - 'SHELL': '/bin/bash', 09:19:18 INFO - 'SHLVL': '1', 09:19:18 INFO - 'TERM': 'linux', 09:19:18 INFO - 'TMOUT': '86400', 09:19:18 INFO - 'USER': 'cltbld', 09:19:18 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', 09:19:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:18 INFO - '_': '/tools/buildbot/bin/python'} 09:19:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 09:19:18 INFO - Running setup.py (path:/tmp/pip-2UvRkF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 09:19:18 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)) 09:19:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 09:19:18 INFO - Running setup.py (path:/tmp/pip-uqXY94-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 09:19:18 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)) 09:19:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 09:19:18 INFO - Running setup.py (path:/tmp/pip-rIHLrN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 09:19:18 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)) 09:19:18 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 09:19:18 INFO - Running setup.py (path:/tmp/pip-Bj8A0Z-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 09:19:19 INFO - Running setup.py (path:/tmp/pip-s9gjrH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 09:19:19 INFO - Running setup.py (path:/tmp/pip-jXSuHl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 09:19:19 INFO - Running setup.py (path:/tmp/pip-yRqwGP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 09:19:19 INFO - Running setup.py (path:/tmp/pip-yOUSXh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 09:19:19 INFO - Running setup.py (path:/tmp/pip-1FtFZm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 09:19:19 INFO - Running setup.py (path:/tmp/pip-5lFZVo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 09:19:19 INFO - Running setup.py (path:/tmp/pip-aX7OvZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 09:19:19 INFO - Running setup.py (path:/tmp/pip-AKakJO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 09:19:19 INFO - Running setup.py (path:/tmp/pip-rPPLsf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 09:19:19 INFO - Running setup.py (path:/tmp/pip-NP5DXJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 09:19:19 INFO - Running setup.py (path:/tmp/pip-XCdLpj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 09:19:19 INFO - Running setup.py (path:/tmp/pip-x1DZku-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 09:19:19 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)) 09:19:19 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 09:19:19 INFO - Running setup.py (path:/tmp/pip-LJBlI6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 09:19:19 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)) 09:19:19 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)) 09:19:19 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)) 09:19:19 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)) 09:19:19 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)) 09:19:19 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)) 09:19:19 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 09:19:19 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 09:19:19 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 09:19:19 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 09:19:19 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 09:19:19 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 09:19:19 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 09:19:21 INFO - Downloading blessings-1.6.tar.gz 09:19:21 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 09:19:21 INFO - Installing collected packages: blessings 09:19:21 INFO - Running setup.py install for blessings 09:19:22 INFO - Successfully installed blessings 09:19:22 INFO - Cleaning up... 09:19:22 INFO - Return code: 0 09:19:22 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 09:19:22 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 09:19:22 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 09:19:22 INFO - Reading from file tmpfile_stdout 09:19:22 INFO - Current package versions: 09:19:22 INFO - argparse == 1.2.1 09:19:22 INFO - blessings == 1.6 09:19:22 INFO - blobuploader == 1.2.4 09:19:22 INFO - docopt == 0.6.1 09:19:22 INFO - manifestparser == 1.1 09:19:22 INFO - mozInstall == 1.12 09:19:22 INFO - mozcrash == 0.16 09:19:22 INFO - mozdebug == 0.1 09:19:22 INFO - mozdevice == 0.48 09:19:22 INFO - mozfile == 1.2 09:19:22 INFO - mozhttpd == 0.7 09:19:22 INFO - mozinfo == 0.9 09:19:22 INFO - mozleak == 0.1 09:19:22 INFO - mozlog == 3.1 09:19:22 INFO - moznetwork == 0.27 09:19:22 INFO - mozprocess == 0.22 09:19:22 INFO - mozprofile == 0.28 09:19:22 INFO - mozrunner == 6.11 09:19:22 INFO - mozscreenshot == 0.1 09:19:22 INFO - mozsystemmonitor == 0.0 09:19:22 INFO - moztest == 0.7 09:19:22 INFO - mozversion == 1.4 09:19:22 INFO - psutil == 3.1.1 09:19:22 INFO - requests == 1.2.3 09:19:22 INFO - wsgiref == 0.1.2 09:19:22 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 09:19:22 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')]} 09:19:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:22 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')]} 09:19:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:22 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 0x7fcbb86b8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd018a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd0290>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe62850>, '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 0xdce330>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdce7c0>, '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': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', '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 09:19:22 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 09:19:22 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 09:19:22 INFO - Using env: {'DISPLAY': ':0', 09:19:22 INFO - 'HOME': '/home/cltbld', 09:19:22 INFO - 'LANG': 'en_US.UTF-8', 09:19:22 INFO - 'LANGUAGE': 'en_US:en', 09:19:22 INFO - 'LOGNAME': 'cltbld', 09:19:22 INFO - 'MAIL': '/var/mail/cltbld', 09:19:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:22 INFO - 'MOZ_NO_REMOTE': '1', 09:19:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:22 INFO - 'NO_EM_RESTART': '1', 09:19:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:19:22 INFO - 'PWD': '/builds/slave/test-pgo', 09:19:22 INFO - 'SHELL': '/bin/bash', 09:19:22 INFO - 'SHLVL': '1', 09:19:22 INFO - 'TERM': 'linux', 09:19:22 INFO - 'TMOUT': '86400', 09:19:22 INFO - 'USER': 'cltbld', 09:19:22 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', 09:19:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:22 INFO - '_': '/tools/buildbot/bin/python'} 09:19:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:22 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)) 09:19:22 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)) 09:19:22 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)) 09:19:22 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)) 09:19:22 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)) 09:19:22 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)) 09:19:22 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)) 09:19:22 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)) 09:19:22 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)) 09:19:22 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)) 09:19:22 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)) 09:19:22 INFO - Cleaning up... 09:19:22 INFO - Return code: 0 09:19:22 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 09:19:22 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')]} 09:19:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:22 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')]} 09:19:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:22 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 0x7fcbb86b8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd018a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd0290>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe62850>, '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 0xdce330>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdce7c0>, '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': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', '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 09:19:22 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 09:19:22 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 09:19:22 INFO - Using env: {'DISPLAY': ':0', 09:19:22 INFO - 'HOME': '/home/cltbld', 09:19:22 INFO - 'LANG': 'en_US.UTF-8', 09:19:22 INFO - 'LANGUAGE': 'en_US:en', 09:19:22 INFO - 'LOGNAME': 'cltbld', 09:19:22 INFO - 'MAIL': '/var/mail/cltbld', 09:19:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:22 INFO - 'MOZ_NO_REMOTE': '1', 09:19:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:22 INFO - 'NO_EM_RESTART': '1', 09:19:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:19:22 INFO - 'PWD': '/builds/slave/test-pgo', 09:19:22 INFO - 'SHELL': '/bin/bash', 09:19:22 INFO - 'SHLVL': '1', 09:19:22 INFO - 'TERM': 'linux', 09:19:22 INFO - 'TMOUT': '86400', 09:19:22 INFO - 'USER': 'cltbld', 09:19:22 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', 09:19:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:22 INFO - '_': '/tools/buildbot/bin/python'} 09:19:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:22 INFO - Downloading/unpacking jsonschema 09:19:22 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 09:19:22 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 09:19:22 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 09:19:22 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 09:19:22 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 09:19:22 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 09:19:24 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 09:19:24 INFO - Downloading/unpacking functools32 (from jsonschema) 09:19:24 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 09:19:24 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 09:19:24 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 09:19:24 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 09:19:24 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 09:19:24 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 09:19:25 INFO - Downloading functools32-3.2.3-2.tar.gz 09:19:25 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 09:19:25 INFO - warning: no files found matching '*.txt' 09:19:25 INFO - no previously-included directories found matching 'build' 09:19:25 INFO - no previously-included directories found matching 'dist' 09:19:25 INFO - no previously-included directories found matching '.git*' 09:19:25 INFO - Installing collected packages: jsonschema, functools32 09:19:25 INFO - Running setup.py install for functools32 09:19:25 INFO - warning: no files found matching '*.txt' 09:19:25 INFO - no previously-included directories found matching 'build' 09:19:25 INFO - no previously-included directories found matching 'dist' 09:19:25 INFO - no previously-included directories found matching '.git*' 09:19:25 INFO - Successfully installed jsonschema functools32 09:19:25 INFO - Cleaning up... 09:19:25 INFO - Return code: 0 09:19:25 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 09:19:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:19:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:19:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:19:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:19:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:19:25 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 0x7fcbb86b8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd018a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xdd0290>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe62850>, '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 0xdce330>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdce7c0>, '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': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', '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 09:19:25 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 09:19:25 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 09:19:25 INFO - Using env: {'DISPLAY': ':0', 09:19:25 INFO - 'HOME': '/home/cltbld', 09:19:25 INFO - 'LANG': 'en_US.UTF-8', 09:19:25 INFO - 'LANGUAGE': 'en_US:en', 09:19:25 INFO - 'LOGNAME': 'cltbld', 09:19:25 INFO - 'MAIL': '/var/mail/cltbld', 09:19:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:25 INFO - 'MOZ_NO_REMOTE': '1', 09:19:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:25 INFO - 'NO_EM_RESTART': '1', 09:19:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:19:25 INFO - 'PWD': '/builds/slave/test-pgo', 09:19:25 INFO - 'SHELL': '/bin/bash', 09:19:25 INFO - 'SHLVL': '1', 09:19:25 INFO - 'TERM': 'linux', 09:19:25 INFO - 'TMOUT': '86400', 09:19:25 INFO - 'USER': 'cltbld', 09:19:25 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', 09:19:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:25 INFO - '_': '/tools/buildbot/bin/python'} 09:19:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:19:25 INFO - Downloading/unpacking flake8 09:19:25 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 09:19:25 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 09:19:25 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 09:19:25 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 09:19:25 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 09:19:25 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 09:19:27 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 09:19:27 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 09:19:27 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 09:19:27 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 09:19:27 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 09:19:27 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 09:19:27 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 09:19:27 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 09:19:27 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 09:19:27 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 09:19:27 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 09:19:27 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 09:19:27 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 09:19:27 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 09:19:27 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 09:19:27 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 09:19:27 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 09:19:27 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 09:19:27 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 09:19:27 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 09:19:27 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 09:19:27 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 09:19:27 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 09:19:28 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 09:19:28 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 09:19:28 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 09:19:28 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 09:19:28 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 09:19:28 INFO - no previously-included directories found matching 'docs/_build' 09:19:28 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 09:19:28 INFO - Running setup.py install for pep8 09:19:28 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 09:19:28 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 09:19:28 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 09:19:28 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 09:19:28 INFO - no previously-included directories found matching 'docs/_build' 09:19:28 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 09:19:28 INFO - Successfully installed flake8 mccabe pyflakes pep8 09:19:28 INFO - Cleaning up... 09:19:28 INFO - Return code: 0 09:19:28 INFO - Running post-action listener: _resource_record_post_action 09:19:28 INFO - Running post-action listener: _start_resource_monitoring 09:19:28 INFO - Starting resource monitoring. 09:19:28 INFO - ##### 09:19:28 INFO - ##### Running install step. 09:19:28 INFO - ##### 09:19:28 INFO - Running pre-action listener: _resource_record_pre_action 09:19:28 INFO - Running main action method: install 09:19:28 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 09:19:28 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 09:19:28 INFO - Reading from file tmpfile_stdout 09:19:28 INFO - Detecting whether we're running mozinstall >=1.0... 09:19:28 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 09:19:28 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 09:19:28 INFO - Reading from file tmpfile_stdout 09:19:28 INFO - Output received: 09:19:28 INFO - Usage: mozinstall [options] installer 09:19:28 INFO - Options: 09:19:28 INFO - -h, --help show this help message and exit 09:19:28 INFO - -d DEST, --destination=DEST 09:19:28 INFO - Directory to install application into. [default: 09:19:28 INFO - "/builds/slave/test-pgo"] 09:19:28 INFO - --app=APP Application being installed. [default: firefox] 09:19:28 INFO - mkdir: /builds/slave/test-pgo/build/application 09:19:28 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 09:19:28 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 09:19:41 INFO - Reading from file tmpfile_stdout 09:19:41 INFO - Output received: 09:19:41 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 09:19:41 INFO - Running post-action listener: _resource_record_post_action 09:19:41 INFO - ##### 09:19:41 INFO - ##### Running run-tests step. 09:19:41 INFO - ##### 09:19:41 INFO - Running pre-action listener: _resource_record_pre_action 09:19:41 INFO - Running main action method: run_tests 09:19:41 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 09:19:41 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 09:19:41 INFO - Python 2.7.3 09:19:41 INFO - Return code: 0 09:19:41 INFO - grabbing minidump binary from tooltool 09:19:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:19:41 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 0xe62850>, '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 0xdce330>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xdce7c0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 09:19:41 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 09:19:41 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 09:19:41 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:19:41 INFO - Return code: 0 09:19:41 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 09:19:41 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 09:19:41 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 09:19:41 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 09:19:41 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 09:19:41 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 09:19:41 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 09:19:42 INFO - Return code: 0 09:19:42 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-016', '--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 09:19:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-016 --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 09:19:42 INFO - Using env: {'DISPLAY': ':0', 09:19:42 INFO - 'HOME': '/home/cltbld', 09:19:42 INFO - 'LANG': 'en_US.UTF-8', 09:19:42 INFO - 'LANGUAGE': 'en_US:en', 09:19:42 INFO - 'LOGNAME': 'cltbld', 09:19:42 INFO - 'MAIL': '/var/mail/cltbld', 09:19:42 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 09:19:42 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 09:19:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:19:42 INFO - 'MOZ_NO_REMOTE': '1', 09:19:42 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 09:19:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:19:42 INFO - 'NO_EM_RESTART': '1', 09:19:42 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:19:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 09:19:42 INFO - 'PWD': '/builds/slave/test-pgo', 09:19:42 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 09:19:42 INFO - 'SHELL': '/bin/bash', 09:19:42 INFO - 'SHLVL': '1', 09:19:42 INFO - 'TERM': 'linux', 09:19:42 INFO - 'TMOUT': '86400', 09:19:42 INFO - 'USER': 'cltbld', 09:19:42 INFO - 'XDG_SESSION_COOKIE': '00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631', 09:19:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:19:42 INFO - '_': '/tools/buildbot/bin/python'} 09:19:42 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-016', '--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 09:19:42 INFO - mozversion application_buildid: 20160401063253 09:19:42 INFO - mozversion application_changeset: 822429c7da5d82e1ec9a11986c2fa35105e01d01 09:19:42 INFO - mozversion application_display_name: Firefox 09:19:42 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:19:42 INFO - mozversion application_name: Firefox 09:19:42 INFO - mozversion application_remotingname: firefox 09:19:42 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 09:19:42 INFO - mozversion application_vendor: Mozilla 09:19:42 INFO - mozversion application_version: 46.0 09:19:42 INFO - mozversion platform_buildid: 20160401063253 09:19:42 INFO - mozversion platform_changeset: 822429c7da5d82e1ec9a11986c2fa35105e01d01 09:19:42 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 09:19:42 INFO - mozversion platform_version: 46.0 09:19:42 INFO - using testdate: 1459527582 09:19:42 INFO - actual date: 1459527582 09:19:42 INFO - starting webserver on 'localhost:32961' 09:19:42 INFO - SUITE-START | Running 3 tests 09:19:42 INFO - TEST-START | dromaeo_css 09:19:42 INFO - operating with platform_type : linux_ 09:19:42 INFO - Initialising browser for dromaeo_css test... 09:19:42 INFO - TEST-INFO | started process 32038 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpOUfEtG/profile http://localhost:32961/getInfo.html) 09:19:46 INFO - PROCESS | 32038 | 09:19:46 INFO - PROCESS | 32038 | (process:32115): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 09:19:46 INFO - PROCESS | 32038 | __metrics Screen width/height:1600/1200 09:19:46 INFO - PROCESS | 32038 | colorDepth:24 09:19:46 INFO - PROCESS | 32038 | Browser inner width/height: 1024/697 09:19:46 INFO - PROCESS | 32038 | __metrics 09:19:47 INFO - TEST-INFO | 32038: exit 0 09:19:47 INFO - Browser initialized. 09:19:47 INFO - Running cycle 1/1 for dromaeo_css test... 09:19:47 INFO - TEST-INFO | started process 32163 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpOUfEtG/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:19:49 INFO - PROCESS | 32163 | 09:19:49 INFO - PROCESS | 32163 | (process:32227): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 09:19:59 INFO - PROCESS | 32163 | RSS: Main: 138977280 09:19:59 INFO - PROCESS | 32163 | 09:20:49 INFO - PROCESS | 32163 | 1459527649292 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] 09:22:56 INFO - PROCESS | 32163 | Cycle 1(1): loaded http://localhost:32961/tests/dromaeo/cssquery-dojo.html (next: http://localhost:32961/tests/dromaeo/cssquery-ext.html) 09:22:57 INFO - PROCESS | 32163 | RSS: Main: 144113664 09:22:57 INFO - PROCESS | 32163 | 09:25:59 INFO - PROCESS | 32163 | Cycle 1(1): loaded http://localhost:32961/tests/dromaeo/cssquery-ext.html (next: http://localhost:32961/tests/dromaeo/cssquery-jquery.html) 09:26:00 INFO - PROCESS | 32163 | RSS: Main: 144564224 09:26:00 INFO - PROCESS | 32163 | 09:29:01 INFO - PROCESS | 32163 | Cycle 1(1): loaded http://localhost:32961/tests/dromaeo/cssquery-jquery.html (next: http://localhost:32961/tests/dromaeo/cssquery-mootools.html) 09:29:02 INFO - PROCESS | 32163 | RSS: Main: 142442496 09:29:02 INFO - PROCESS | 32163 | 09:32:04 INFO - PROCESS | 32163 | Cycle 1(1): loaded http://localhost:32961/tests/dromaeo/cssquery-mootools.html (next: http://localhost:32961/tests/dromaeo/cssquery-prototype.html) 09:32:04 INFO - PROCESS | 32163 | RSS: Main: 143437824 09:32:04 INFO - PROCESS | 32163 | 09:35:06 INFO - PROCESS | 32163 | Cycle 1(1): loaded http://localhost:32961/tests/dromaeo/cssquery-prototype.html (next: http://localhost:32961/tests/dromaeo/cssquery-yui.html) 09:35:07 INFO - PROCESS | 32163 | RSS: Main: 144355328 09:35:07 INFO - PROCESS | 32163 | 09:38:09 INFO - PROCESS | 32163 | Cycle 1(1): loaded http://localhost:32961/tests/dromaeo/cssquery-yui.html (next: http://localhost:32961/tests/dromaeo/cssquery-dojo.html) 09:38:09 INFO - PROCESS | 32163 | RSS: Main: 145797120 09:38:09 INFO - PROCESS | 32163 | 09:38:09 INFO - PROCESS | 32163 | __start_tp_report 09:38:09 INFO - PROCESS | 32163 | _x_x_mozilla_page_load 09:38:09 INFO - PROCESS | 32163 | _x_x_mozilla_page_load_details 09:38:09 INFO - PROCESS | 32163 | |i|pagename|runs| 09:38:09 INFO - PROCESS | 32163 | |0;dojo.html;3200.423923693735;3259.7881137726044;3282.031800618817;3288.9671103288974;3300.8844690435826;5251.02855971645;5289.153735402331;5298.814541491049;5303.496167864057;5344.625876188668;5257.36911570612;5292.417834038262;5292.497212764791;5300.708461034642;5307.071262529052;4828.058528586918;4888.022395520892;4892.461829198785;4894.461609223001;4913.70517768935;4802.543758342952;4921.064997650435;4950.6287028472825;4960.181570040939;5024.723640199788;4921.237208232712;4966.329545511364;4972.453030166679;4975.800967961295;4977.153883839738;4855.126077306083;4882.951170488285;4915.410150781929;4924;4938.975305123469;4742.573168414825;4751.097291514601;4795.304680821261;4809;4860.100881336929;5110.565601923841;5120.743962801882;5141.151709967889;5142.9228561571235;5206.349206349207;5698.601097923147;5707.343655479632;5710.77156913723;5711.228984087178;5715.771369145229;5651.689157096358;5676.574256930747;5705.971470142665;5731.168980497804;5733.397993210695;5458.699771512565;5464.26232458617;5466.34403871534;5473.8357849264585;5473.863153421156;5867.413258674099;5910.645361278337;5911;5917.230760001258;5929.792457264061;5596.832095037155;5651.378348381675;5654.85862853432;5687.260656114761;5711.257536520309;5738.340090889517;5760.711964401763;5762.337331206965;5784.132380142928;5786.07422812348;5688.06146985751;5703.828885133453;5711.628744131618;5719.8570035749435;5725.227094342211;5634.985702573576;5662.320521537442;5669.064604340238;5734.455226753452;5779.88440231193;4395.099004704028;4399.692021558524;4412.918834885473;4416.492103408149;4438.911221775611;3905.2384784967226;3977.105151340983;3984.3425834737523;3987.8205480753436;4005.6595189408645;5387.111126664135;5454.618176727591;5502.504774570308;5509.752061157257;5551.528120109755;5688.260526131577;5750.2524671793235;5753.252077229933;5767.336756272998;5776.306843178845;5347.759350829222;5360.946390536123;5432.185172224198;5435.864103397446;5441.428649991773;4964.081644895706;5018.096742586296;5020.297158397827;5032.194848824171;5073.543381095719;5857.648541087548;5860.09168578871;5898.498627616615;5908.911366329508;5914.645121292736;5640.0693885508435;5746.482816546447;5757.740901659519;5764.682942438206;5797.1304304353;5915.201447804491;5925.674087925206;5937.435943585352;5960.0761881908375;5974.253218347707;5647.774089036392;5663;5715.514181294637;5722.0844664855085;5739.71301434935;5660.405657406078;5772.711364431846;5773.971130144322;5778.133280008033;5820.388859169726;5647.830565083054;5683.033884239607;5694.743736531949;5707.029804933254;5729.570282228766;5564.638298510584;5564.8330550083565;5568.721563921868;5569.832905012856;5569.972150139223;5475.5072043516275;5492.670439773627;5500.147477141049;5546.140348246028;5577.44225577439;5537;5542.224088627676;5589.916151257653;5600.663960162403;5615.241942337732;5403.972980135074;5467.9453205467435;5472.20653005304;5491.039068162976;5524.254225679642 09:38:09 INFO - PROCESS | 32163 | |1;ext.html;544.4990608640051;556.7772890843663;561.7612514681259;577.9595428320018;583.4661284924294;29799.702002979964;30471.542926856087;36989;37022.25955480889;37062.81468592653;40580;40946.385804212885;40985.79507102468;41089.58910410895;41168;8791.384603077771;9095.954520227422;9131.771705707344;9132.680356187535;9134.223590994774;8807.559622018873;8943.552822358888;8995.550222488882;8999.100089990981;9005.909940900572;8892.15524525169;9006.369554131214;9039.548022598843;9049.411788233743;9057.365984381096;8873.778155546099;9003.684871029482;9024.548772561378;9030.819383612292;9039.367244292902;8767.605457754416;8999.775005624846;9003.369764116514;9005;9022.819543609092;41037;41081.1783764326;41257.38113928294;41327;41462.585374146176;3491.965080349215;3637.727170462226;3665.9083522911874;3915.353966595508;3993.341098718708;32679.346413071606;32769.6723032769;33019.83490082534;33104.3379132416;33230.667693323;3627.8548858045647;3676.4228535473508;3699.130704284491;3706.4440333949856;3726.81365931705;224611;226304;226338;226529.86735066384;227935;45241.321380179324;45829.7708511462;45839;45985.540144598795;46048.769756151676;44041.559584404386;44447;44487.777561112634;44516.55483445189;44557.777211114386;16750.413735519443;16836.74744878803;16838.410655627238;16872.831271687126;16874;13832.30838458073;13884.4446222152;13890.652733681738;13999.440022399194;14027.158370497802;15434.151121688416;15488.14815185153;15523.37906483728;15659.686806263811;15689;6010.549208809357;6056.3338032816355;6163.075538669235;6183.474404675563;6237.251529816361;1095.386583513235;1105.8617672790901;1108.545496346494;1113.276370359273;1127.5546159267044;29180.854095729384;29250.853745731136;29332.826686932283;29634.703652963195;29746.40507189844;1125.9662210133708;1178.6699724077273;1179.7994340962057;1239.2997956154743;1253.9059570532247;15246.618834529003;15352.385904563916;15429.614259643375;15565;15577.454789082327;345636;522911;528452;530599;545992;53980.73009635005;54733;54760.452395475535;54789.726051369486;54943.45056549463;1497.2513743128436;1514.0839791925946;1517.8785697144424;1518.8177418709824;1526.6259766357314;30384.544231836982;30636.540451893685;31012;31183.53224701586;31441.685583143877;48414;48789.51210487992;49071;49194.508054918995;49204.75397622989;328833;331418;331675;331819;332127;33882.37409353389;34678.479822802175;35037;35056.47415288722;35085.122871928404;45730;45891.31163032624;45910;45915.54084459112;46922.29616555686;39415.21169576535;39418;39996.20007599774;40433.39349909695;40801.38797918093;38955.61044389633;39071.80464097775;39363.60636393599;39599.40600891047;39749.403758944216;40266.5840049598;40789.592104078576;41071.17857642771;41279.58720412757;41710.1657966845;30934.69065309318;31092.533611995386;32045.519317209793;32601.510977335834;32792;26635.86682066577;27529.174124776287;27568.172954811387;27604.723952760214;27656 09:38:09 INFO - PROCESS | 32163 | |2;jquery.html;383.97120215983807;384.12228058885444;387.73827666325235;388.5628667748783;391.69643526267157;15520.922395388006;16419;17065.744013839772;19085.332013379517;19089;11647.6505704829;12019.7596048079;12091.153619246656;17117.40089096882;17888.910555447237;4990.276409920569;5034.446210916796;5142.382914050319;5156.458571849958;6325.715342809584;5397.568194544427;5596.132599447093;5602.60781745278;5630.042892708249;6214.627122372672;5440;5577.721113944307;5630.7184640768;5638.379778224392;5657.462541058593;5446.945530544704;5580.330360356763;5649.265595472603;5888.970555147197;5943.940560594382;5766.279215098113;5770.04794208955;5777.971110144465;5787.623804452697;5803.506701930341;19294.71057934132;19464.513387165433;20082.397528074034;20472;20553.69169462459;2265.29775769512;2285.394370491821;2288.485090854561;2289.461976435536;2296.4144143243366;10360.067593916583;10409.843852342221;13308.800367994489;14076.366563504667;14079;1895.4218963216213;2001.2195243854908;2053.8254248388903;2076.5223998480433;2148.4091874734418;52769.73615131938;53648.73175634097;54078.18882716762;55064.72467637636;62921.370786292006;10973.231873768918;11152.330860148417;11259.943700281447;11278.436078196057;11281.435928203557;14223.28883555818;14929;15085.924570377078;15159.545213643609;15161;8411.915880841236;8627.22354988054;8772.78068048304;8813.691520796741;8825.02924678285;8579.2707619853;8601.870971935426;8602.18279263469;8602.31181505478;8632.266257368194;4618.607418369409;4775.498572649891;4849.830255941025;4855.465898751135;4885;2032.3394896658644;2057.5473395852887;2067.648499755045;2073.8237249833633;2094.759102703178;1013.2957594471771;1041.0890470838017;1060.7772367802693;1072.4852071005805;1088.8584484017026;16986.405475808286;17677.166535043405;17692.115394230237;17761.289548418175;18165;945.9006804285589;999.2305924438142;1049.884512703602;1070.0957690751459;1091.645215305029;9294.488803115759;9441.90558094424;9472.242220622335;9505.572249248662;9720.75698107553;512431;524875;524968;548170;603536;47375;47952.04095918132;48132.5186748135;81101.18898811055;82538.17461825426;1204.373725662668;1247.2516490106045;1248.4631608408472;1254.1095821966323;1255.2029461291963;16054.759178612096;16220.51338459848;16374.83625163733;16446.342146314015;16564.254608542404;32440;33494.665053349156;33847;34261.143471413416;34368.312633747686;43595.78202108969;44343.556564433944;45286.54713452955;45740;46004.7699761499;7658.349040331635;7801.258880406353;7828.882566761617;8034.236747508978;8139.18608139205;11344.659660210207;11682.182247242612;11751.118666099906;11936.880631193577;11949.701257468632;9551.42691438516;10003.449810260505;10205.38767673942;10309.175265978854;10384.169266458513;10068.647597334351;10491.702153062577;10998.615048473264;11022.669319920415;11089.946455086754;3106.7048630380077;3142.827144507074;7829.277558937025;9781.804363912825;10232;8342.08237093907;8355.164483551596;8438.324934005142;8459.788505287417;8483.787905302417;9062.275017998412;10948;10967.725806854893;10984.725381865517;11120.332780033224 09:38:09 INFO - PROCESS | 32163 | |3;mootools.html;1510.305259580593;1516.9089854608728;1687.4178408449088;1818.1727314072098;1839.8896066236034;7998.880016799752;8024.398170137241;8117.107118217006;8206.794830129249;8217.219364160403;8030.116687164422;8034.678612855479;8147.9592602037055;8160.836783264331;8241.752747417571;2417.480241748028;2438.6585877977095;2444.841085329448;2451.1421002649017;2454.447749256421;2288.141946769961;2408.1330720940537;2435.7077150741934;2451.669024681672;2453.6442215878687;2352.4001379648253;2406.7111946566347;2420.4190994161363;2422.358075110097;2424.248482970285;2417.9361081124425;2450.0567281596536;2452.043702955849;2478.3184624228393;2482.2925466242214;2411.9758802411925;2445.8165637577254;2450.47314827313;2455.3861534616344;2458.6312053191987;8021.5989200540325;8061.95969020157;8089.110197878229;8094.433389662726;8114.797130071736;4918.188498897677;5065.493450654942;5088.796448142107;5097.184450487941;5109.770060347293;2903.738663520272;2971.435427268834;2982.075556577468;3012.548117782328;3031.6513600935955;994.7612572982505;1007.2948935745007;1013.7668336282622;1022.4989755020061;1064.6912395405323;11182.832257516144;11260.887391126147;11282.717932051764;11284.040856527123;11304.69995950468;4293.699441039097;4314.395984562164;4355.60799528044;4440.489343725449;4461.996050888589;9097.77255568616;9110.81778364429;9127.452352858849;9134.954325228331;9138.68014619485;4999.650024498323;5028.673136246205;5034.11902916988;5051.747412629354;5053.014662140848;4609.124266389375;4644.465886423037;4659.184642687516;4673.018666080094;4683.95316046842;3598.226381328027;3696.1129328960856;3707.277080969185;3708.2768860072565;3722.106694393326;1099.2689861242345;1100.4442756408123;1101.603422767819;1101.8292164714483;1151.8329842172839;1229.1580267516779;1234.623439850854;1312.2454588611586;1433.956981290563;1469.169918995764;7750.0699916010435;7831.921680783119;7988.16124306951;8007.599620018976;8029.759107226792;1209.7580483903255;1226.3806777577445;1230.1081715756184;1232.6240496648609;1240.838690970168;6195.132681424604;6199.225096862892;6241.531885108635;6248.28144763349;6259.123722678829;9531.809363812685;9790.510474476248;9818.80362392748;9828.410295382157;10036.598536058476;9807.166390856715;9939.950300248453;9943.055409736064;9992.150667193224;10049.748756281151;7399.408047356199;7429.517081389692;7439.776806695808;7441.479096463304;7514.624268786539;7529.1717911028645;7572.659230334538;7608.01095857535;7680.423968202519;7702.268284512962;8665.17680820321;8858.247049000649;8887.822243555222;8899.822003559762;8998.14517620825;8983.505907175168;9030.683926062557;9032.638694452411;9074.274058075207;9423.340366174301;7091.539049961736;7167.964160179165;7169.426445884421;7175.892361614476;7178.066851309296;7516.586587737727;7690.461667683208;7712.691492340244;7718.807029824299;7802.570858602604;7176.677049532679;7225.349718525358;7319.414446844133;7320.377767889789;7345.0084238627105;7277.417806575567;7317.67070481819;7420.517666351886;7463.104427468738;7515.736949206752;7434.628268586441;7553.773386798405;7578.962105189439;7664.425168112302;7666.2333766625125;6895.448364130958;6895.793126206222;6901.068355772108;6909.136357955255;6941.409980151744;6890.793276201722;6906;6937.687804048931;6953.687084081127;7093.32613401726 09:38:09 INFO - PROCESS | 32163 | |4;prototype.html;355.2929669956786;365.1747051663241;367.69297636473544;369.41816638793887;373.65250317205005;6366.2360516738;6409.391107844753;6485.546011779177;6488.610683359002;6598.901016484757;6426.582272152307;6471.288158302583;6482.513811464136;6492.7402903883785;6496.350364963513;4861;4865.318855360252;4875.390576177978;4876.512348765131;4890.975545122269;4882.731449770279;4894.8286809961655;4896.755162241891;4897.338859254009;4910.386201724785;4766.880827979294;4809.206480930642;4887.8778030549165;4888.169011268093;4899.3385892904535;4849.709017458946;4875.8781030474165;4877.073356062355;4881.1213981483315;4889.608831293488;4322.697411181219;4330.805113769888;4336.544662810423;4337.7397356158735;4342.348647702838;6059.636421814661;6065.727042283108;6071.150038994544;6071.998120310143;6072.2713274406915;5573.944260557383;5682.204491371212;5726.3700992890745;5782.392848750863;5801.593888427812;6837;6846.554973926679;6849.691763870638;6850.794476165723;6863.931360686379;4806.951930480685;4820.035992801454;4821.37322148122;4827.227643577011;4836.830710925136;7023.086998690189;7089.397401220851;7174.282571742836;7180.5691658500655;7184.928150718531;4900.436449808318;4902.852914412502;4905.484924082992;4905.8037678492465;4923.729194894315;4978.551930326288;4982.5515703586125;4986.326845875833;4986.601071914238;4996.250562415594;5729.942700573024;5746.798862039808;5750.712464376765;5755.309362876398;5758.856028599234;6666.200055993312;6814.1482314710665;6827.795166145023;6901.723931042702;6905.067815844897;1724.2413338131432;1730.108993868159;1734.9045802480732;1741.7648617436485;1745.860331173503;1180.8523934508187;1183.2722875431548;1196.282230661596;1208.5165933626445;1211.0130243851409;6607.57050791697;6631.602103873783;6684.699188536528;6734.158230221223;6754.864902701918;7037.577745335297;7122.501424900311;7135.607541585159;7160.749373771893;7162.570245785269;6499.155109835691;6645.401913827779;6694.230163531159;6722.058911752359;6728;3839.9232015359535;3843.404272337736;3880.8835734927434;3881.359575669983;3888.047428380065;7315;7325.816854578678;7342.3758980487255;7370.520916140541;7389.704411823574;7216.025836512109;7343.963280183565;7376.077990251219;7392.223816499298;7405.074365704287;7385.372243359375;7400.555966642019;7402.296781805828;7408.592527411044;7412.110546734426;6898.172219333512;7143.321384468467;7147;7165.892511612435;7181.676824543013;6996.965015174892;7002.7899163025195;7050.2597227292445;7102.254263302279;7113.82215444618;7362.558246505227;7363.263673632594;7370.815729606588;7376;7392.630368481447;4844.224924012141;4858.416989961227;4901.730404827768;4911.263310503453;4918.704877707206;7146.606936618328;7172.995780590617;7176.318249766473;7192.856142877218;7207.522457896223;6961.477889158232;6972.825679358057;6986.47601429905;6987.545809522569;6991.720331186695;6742.898856517254;6963.1296087989;6976.895346569907;6984.441244700513;6991;6858.451323893977;6870.351115732288;6870.519063665495;6882.380585747307;6883.242843287335;6985.5808651481075;6987.860242795217;7006.2643422439905;7008.983697363752;7025.543339682904;6682.298358672269;6820.897686534805;6822.658867056726;6822.829429264308;6841.24746277919 09:38:09 INFO - PROCESS | 32163 | |5;yui.html;864.9610767515462;931.5063016601199;933.5378987401238;939.4222553129825;963.2438535749438;16779.328826846926;17063.06153161577;17081.060541670202;17098.743518847226;17137;15415.92292038541;15518.068915865057;15518.224088795543;15537.223138843041;15605.609859753511;883.3286702106413;888.0852721696663;908.0510866144895;910.3900386740867;914.9588268527932;899.5052721003455;904.5567671840784;906.8095699903029;909.7680091576639;910.0444533240104;947.8056998315329;947.9099485548896;948.340903072365;948.7153853843854;954.5704433005141;935.1490143968989;939.3096074385321;940.3511577011908;941.0589410589411;946.7396465971879;695.93736563709;698.0715648187949;699.4823830365493;701.5264696330008;701.6000879498688;14274.357653905496;14291.285435728172;14353;14371.640708982255;14391;13527.594172174851;13745.24401157936;13752.65618359539;13846.723065538632;14053.578392648236;11390.658280251606;11428.657140285804;11665.475053622607;11760.941195294054;11941;3953.9802300988313;4007.479027726406;4008.098177909976;4043.878683639466;4085.20338533986;52564;52609.736951315;52680.47319526794;52841;52988.47011529874;10279.897201027894;10455.68632941013;10608.734781630366;10803.729906752395;10905.890941090645;19022.714659280122;19043.42869713911;19069.046547672562;19104.61790764177;19188.13653385601;7807.18024607408;7840.215978402114;7988.680452781824;8112.797180070545;8225.054118776297;4600.263957766741;4610.077984403133;4629.1436084324505;4648.093621743727;4689.273162659793;3046.2993511492036;3048.1465189746905;3055.220918665726;3061.7856750027286;3063.172943305295;546.1916363781626;558.4136656510648;561.9325680918234;565.0535353283316;565.1945976982784;646.1890327638783;650.1385663995226;658.558765627031;665.012456502094;682.9009793579903;8666.610002549774;8886.777830554158;8969.50667713282;9126;9149.862752058725;592.8547505861092;656.9310222426576;678.7714237230629;682.2358957967109;753.8605358008676;4092.2838503262406;4127.8968025798995;4164.583541645811;4194.6853985951175;4226.661867050629;54284.18573721397;55362.72318638381;55633;55724.72137639286;55815;53090.46909530932;54768.17847732287;56359.43640563542;56402.71798640981;56459.43540564624;48097.75951120292;48527.75736121297;49136.75431622819;49195;49826.501734982914;8201.671933122609;8211.507309561446;8236.588170591327;8238.62511384766;8307.750767476986;34194.14514637154;34237.315253695284;35368;35387.115322117155;35972.64027359693;42757.57242427536;43956.34065489084;48356.51643483661;48362.75818621025;52399.594026388164;11387.202895797214;11525;12271.938640306742;12592.307423091817;12856.614301570968;13865.722685546434;14086.788698169741;14161.858381416054;14566.708665826412;14978.026428282563;12396.256224626552;12452.501899923902;12462.127651064338;12782.169159004636;12844.743105137659;12308.26150430977;12328.876711232773;13236.13965092266;13294.20234785916;13299.80050299227;10653.627123050655;11144.996950274513;12754.744905101661;12792;13027.804582931452;10106.949465252626;10291.382517049002;10392.636257731245;10516.894831051592;10569.67879015123;9462.810743785223;9567.138957493858;10261.538230779783;10433.686989390331;10484.528196231035 09:38:09 INFO - PROCESS | 32163 | __end_tp_report 09:38:09 INFO - PROCESS | 32163 | __start_cc_report 09:38:09 INFO - PROCESS | 32163 | _x_x_mozilla_cycle_collect,285 09:38:09 INFO - PROCESS | 32163 | __end_cc_report 09:38:09 INFO - PROCESS | 32163 | __startTimestamp1459528689845__endTimestamp 09:38:09 INFO - PROCESS | 32163 | 09:38:09 INFO - PROCESS | 32163 | ------- Summary: start ------- 09:38:09 INFO - PROCESS | 32163 | Number of tests: 6 09:38:09 INFO - PROCESS | 32163 | 09:38:09 INFO - PROCESS | 32163 | [#0] dojo.html Cycles:165 Average:5332.80 Median:5537.00 stddev:578.44 (10.4%) stddev-sans-first:555.50 09:38:09 INFO - PROCESS | 32163 | Values: 3200.4 3259.8 3282.0 3289.0 3300.9 5251.0 5289.2 5298.8 5303.5 5344.6 5257.4 5292.4 5292.5 5300.7 5307.1 4828.1 4888.0 4892.5 4894.5 4913.7 4802.5 4921.1 4950.6 4960.2 5024.7 4921.2 4966.3 4972.5 4975.8 4977.2 4855.1 4883.0 4915.4 4924.0 4939.0 4742.6 4751.1 4795.3 4809.0 4860.1 5110.6 5120.7 5141.2 5142.9 5206.3 5698.6 5707.3 5710.8 5711.2 5715.8 5651.7 5676.6 5706.0 5731.2 5733.4 5458.7 5464.3 5466.3 5473.8 5473.9 5867.4 5910.6 5911.0 5917.2 5929.8 5596.8 5651.4 5654.9 5687.3 5711.3 5738.3 5760.7 5762.3 5784.1 5786.1 5688.1 5703.8 5711.6 5719.9 5725.2 5635.0 5662.3 5669.1 5734.5 5779.9 4395.1 4399.7 4412.9 4416.5 4438.9 3905.2 3977.1 3984.3 3987.8 4005.7 5387.1 5454.6 5502.5 5509.8 5551.5 5688.3 5750.3 5753.3 5767.3 5776.3 5347.8 5360.9 5432.2 5435.9 5441.4 4964.1 5018.1 5020.3 5032.2 5073.5 5857.6 5860.1 5898.5 5908.9 5914.6 5640.1 5746.5 5757.7 5764.7 5797.1 5915.2 5925.7 5937.4 5960.1 5974.3 5647.8 5663.0 5715.5 5722.1 5739.7 5660.4 5772.7 5774.0 5778.1 5820.4 5647.8 5683.0 5694.7 5707.0 5729.6 5564.6 5564.8 5568.7 5569.8 5570.0 5475.5 5492.7 5500.1 5546.1 5577.4 5537.0 5542.2 5589.9 5600.7 5615.2 5404.0 5467.9 5472.2 5491.0 5524.3 09:38:09 INFO - PROCESS | 32163 | 09:38:09 INFO - PROCESS | 32163 | [#1] ext.html Cycles:180 Average:51137.66 Median:21493.58 stddev:98226.75 (457.0%) stddev-sans-first:98428.85 09:38:09 INFO - PROCESS | 32163 | Values: 544.5 556.8 561.8 578.0 583.5 29799.7 30471.5 36989.0 37022.3 37062.8 40580.0 40946.4 40985.8 41089.6 41168.0 8791.4 9096.0 9131.8 9132.7 9134.2 8807.6 8943.6 8995.6 8999.1 9005.9 8892.2 9006.4 9039.5 9049.4 9057.4 8873.8 9003.7 9024.5 9030.8 9039.4 8767.6 8999.8 9003.4 9005.0 9022.8 41037.0 41081.2 41257.4 41327.0 41462.6 3492.0 3637.7 3665.9 3915.4 3993.3 32679.3 32769.7 33019.8 33104.3 33230.7 3627.9 3676.4 3699.1 3706.4 3726.8 224611.0 226304.0 226338.0 226529.9 227935.0 45241.3 45829.8 45839.0 45985.5 46048.8 44041.6 44447.0 44487.8 44516.6 44557.8 16750.4 16836.7 16838.4 16872.8 16874.0 13832.3 13884.4 13890.7 13999.4 14027.2 15434.2 15488.1 15523.4 15659.7 15689.0 6010.5 6056.3 6163.1 6183.5 6237.3 1095.4 1105.9 1108.5 1113.3 1127.6 29180.9 29250.9 29332.8 29634.7 29746.4 1126.0 1178.7 1179.8 1239.3 1253.9 15246.6 15352.4 15429.6 15565.0 15577.5 345636.0 522911.0 528452.0 530599.0 545992.0 53980.7 54733.0 54760.5 54789.7 54943.5 1497.3 1514.1 1517.9 1518.8 1526.6 30384.5 30636.5 31012.0 31183.5 31441.7 48414.0 48789.5 49071.0 49194.5 49204.8 328833.0 331418.0 331675.0 331819.0 332127.0 33882.4 34678.5 35037.0 35056.5 35085.1 45730.0 45891.3 45910.0 45915.5 46922.3 39415.2 39418.0 39996.2 40433.4 40801.4 38955.6 39071.8 39363.6 39599.4 39749.4 40266.6 40789.6 41071.2 41279.6 41710.2 30934.7 31092.5 32045.5 32601.5 32792.0 26635.9 27529.2 27568.2 27604.7 27656.0 09:38:09 INFO - PROCESS | 32163 | 09:38:09 INFO - PROCESS | 32163 | [#2] jquery.html Cycles:180 Average:27743.25 Median:33670.83 stddev:88657.60 (263.3%) stddev-sans-first:88882.51 09:38:09 INFO - PROCESS | 32163 | Values: 384.0 384.1 387.7 388.6 391.7 15520.9 16419.0 17065.7 19085.3 19089.0 11647.7 12019.8 12091.2 17117.4 17888.9 4990.3 5034.4 5142.4 5156.5 6325.7 5397.6 5596.1 5602.6 5630.0 6214.6 5440.0 5577.7 5630.7 5638.4 5657.5 5446.9 5580.3 5649.3 5889.0 5943.9 5766.3 5770.0 5778.0 5787.6 5803.5 19294.7 19464.5 20082.4 20472.0 20553.7 2265.3 2285.4 2288.5 2289.5 2296.4 10360.1 10409.8 13308.8 14076.4 14079.0 1895.4 2001.2 2053.8 2076.5 2148.4 52769.7 53648.7 54078.2 55064.7 62921.4 10973.2 11152.3 11259.9 11278.4 11281.4 14223.3 14929.0 15085.9 15159.5 15161.0 8411.9 8627.2 8772.8 8813.7 8825.0 8579.3 8601.9 8602.2 8602.3 8632.3 4618.6 4775.5 4849.8 4855.5 4885.0 2032.3 2057.5 2067.6 2073.8 2094.8 1013.3 1041.1 1060.8 1072.5 1088.9 16986.4 17677.2 17692.1 17761.3 18165.0 945.9 999.2 1049.9 1070.1 1091.6 9294.5 9441.9 9472.2 9505.6 9720.8 512431.0 524875.0 524968.0 548170.0 603536.0 47375.0 47952.0 48132.5 81101.2 82538.2 1204.4 1247.3 1248.5 1254.1 1255.2 16054.8 16220.5 16374.8 16446.3 16564.3 32440.0 33494.7 33847.0 34261.1 34368.3 43595.8 44343.6 45286.5 45740.0 46004.8 7658.3 7801.3 7828.9 8034.2 8139.2 11344.7 11682.2 11751.1 11936.9 11949.7 9551.4 10003.4 10205.4 10309.2 10384.2 10068.6 10491.7 10998.6 11022.7 11089.9 3106.7 3142.8 7829.3 9781.8 10232.0 8342.1 8355.2 8438.3 8459.8 8483.8 9062.3 10948.0 10967.7 10984.7 11120.3 09:38:09 INFO - PROCESS | 32163 | 09:38:09 INFO - PROCESS | 32163 | [#3] mootools.html Cycles:180 Average:5747.29 Median:6574.96 stddev:2958.50 (45.0%) stddev-sans-first:2949.65 09:38:09 INFO - PROCESS | 32163 | Values: 1510.3 1516.9 1687.4 1818.2 1839.9 7998.9 8024.4 8117.1 8206.8 8217.2 8030.1 8034.7 8148.0 8160.8 8241.8 2417.5 2438.7 2444.8 2451.1 2454.4 2288.1 2408.1 2435.7 2451.7 2453.6 2352.4 2406.7 2420.4 2422.4 2424.2 2417.9 2450.1 2452.0 2478.3 2482.3 2412.0 2445.8 2450.5 2455.4 2458.6 8021.6 8062.0 8089.1 8094.4 8114.8 4918.2 5065.5 5088.8 5097.2 5109.8 2903.7 2971.4 2982.1 3012.5 3031.7 994.8 1007.3 1013.8 1022.5 1064.7 11182.8 11260.9 11282.7 11284.0 11304.7 4293.7 4314.4 4355.6 4440.5 4462.0 9097.8 9110.8 9127.5 9135.0 9138.7 4999.7 5028.7 5034.1 5051.7 5053.0 4609.1 4644.5 4659.2 4673.0 4684.0 3598.2 3696.1 3707.3 3708.3 3722.1 1099.3 1100.4 1101.6 1101.8 1151.8 1229.2 1234.6 1312.2 1434.0 1469.2 7750.1 7831.9 7988.2 8007.6 8029.8 1209.8 1226.4 1230.1 1232.6 1240.8 6195.1 6199.2 6241.5 6248.3 6259.1 9531.8 9790.5 9818.8 9828.4 10036.6 9807.2 9940.0 9943.1 9992.2 10049.7 7399.4 7429.5 7439.8 7441.5 7514.6 7529.2 7572.7 7608.0 7680.4 7702.3 8665.2 8858.2 8887.8 8899.8 8998.1 8983.5 9030.7 9032.6 9074.3 9423.3 7091.5 7168.0 7169.4 7175.9 7178.1 7516.6 7690.5 7712.7 7718.8 7802.6 7176.7 7225.3 7319.4 7320.4 7345.0 7277.4 7317.7 7420.5 7463.1 7515.7 7434.6 7553.8 7579.0 7664.4 7666.2 6895.4 6895.8 6901.1 6909.1 6941.4 6890.8 6906.0 6937.7 6953.7 7093.3 09:38:09 INFO - PROCESS | 32163 | 09:38:09 INFO - PROCESS | 32163 | [#4] prototype.html Cycles:180 Average:5770.35 Median:6603.24 stddev:1747.34 (26.5%) stddev-sans-first:1704.32 09:38:09 INFO - PROCESS | 32163 | Values: 355.3 365.2 367.7 369.4 373.7 6366.2 6409.4 6485.5 6488.6 6598.9 6426.6 6471.3 6482.5 6492.7 6496.4 4861.0 4865.3 4875.4 4876.5 4891.0 4882.7 4894.8 4896.8 4897.3 4910.4 4766.9 4809.2 4887.9 4888.2 4899.3 4849.7 4875.9 4877.1 4881.1 4889.6 4322.7 4330.8 4336.5 4337.7 4342.3 6059.6 6065.7 6071.2 6072.0 6072.3 5573.9 5682.2 5726.4 5782.4 5801.6 6837.0 6846.6 6849.7 6850.8 6863.9 4807.0 4820.0 4821.4 4827.2 4836.8 7023.1 7089.4 7174.3 7180.6 7184.9 4900.4 4902.9 4905.5 4905.8 4923.7 4978.6 4982.6 4986.3 4986.6 4996.3 5729.9 5746.8 5750.7 5755.3 5758.9 6666.2 6814.1 6827.8 6901.7 6905.1 1724.2 1730.1 1734.9 1741.8 1745.9 1180.9 1183.3 1196.3 1208.5 1211.0 6607.6 6631.6 6684.7 6734.2 6754.9 7037.6 7122.5 7135.6 7160.7 7162.6 6499.2 6645.4 6694.2 6722.1 6728.0 3839.9 3843.4 3880.9 3881.4 3888.0 7315.0 7325.8 7342.4 7370.5 7389.7 7216.0 7344.0 7376.1 7392.2 7405.1 7385.4 7400.6 7402.3 7408.6 7412.1 6898.2 7143.3 7147.0 7165.9 7181.7 6997.0 7002.8 7050.3 7102.3 7113.8 7362.6 7363.3 7370.8 7376.0 7392.6 4844.2 4858.4 4901.7 4911.3 4918.7 7146.6 7173.0 7176.3 7192.9 7207.5 6961.5 6972.8 6986.5 6987.5 6991.7 6742.9 6963.1 6976.9 6984.4 6991.0 6858.5 6870.4 6870.5 6882.4 6883.2 6985.6 6987.9 7006.3 7009.0 7025.5 6682.3 6820.9 6822.7 6822.8 6841.2 09:38:09 INFO - PROCESS | 32163 | 09:38:09 INFO - PROCESS | 32163 | [#5] yui.html Cycles:180 Average:14705.28 Median:4605.17 stddev:16587.94 (360.2%) stddev-sans-first:16601.91 09:38:09 INFO - PROCESS | 32163 | Values: 865.0 931.5 933.5 939.4 963.2 16779.3 17063.1 17081.1 17098.7 17137.0 15415.9 15518.1 15518.2 15537.2 15605.6 883.3 888.1 908.1 910.4 915.0 899.5 904.6 906.8 909.8 910.0 947.8 947.9 948.3 948.7 954.6 935.1 939.3 940.4 941.1 946.7 695.9 698.1 699.5 701.5 701.6 14274.4 14291.3 14353.0 14371.6 14391.0 13527.6 13745.2 13752.7 13846.7 14053.6 11390.7 11428.7 11665.5 11760.9 11941.0 3954.0 4007.5 4008.1 4043.9 4085.2 52564.0 52609.7 52680.5 52841.0 52988.5 10279.9 10455.7 10608.7 10803.7 10905.9 19022.7 19043.4 19069.0 19104.6 19188.1 7807.2 7840.2 7988.7 8112.8 8225.1 4600.3 4610.1 4629.1 4648.1 4689.3 3046.3 3048.1 3055.2 3061.8 3063.2 546.2 558.4 561.9 565.1 565.2 646.2 650.1 658.6 665.0 682.9 8666.6 8886.8 8969.5 9126.0 9149.9 592.9 656.9 678.8 682.2 753.9 4092.3 4127.9 4164.6 4194.7 4226.7 54284.2 55362.7 55633.0 55724.7 55815.0 53090.5 54768.2 56359.4 56402.7 56459.4 48097.8 48527.8 49136.8 49195.0 49826.5 8201.7 8211.5 8236.6 8238.6 8307.8 34194.1 34237.3 35368.0 35387.1 35972.6 42757.6 43956.3 48356.5 48362.8 52399.6 11387.2 11525.0 12271.9 12592.3 12856.6 13865.7 14086.8 14161.9 14566.7 14978.0 12396.3 12452.5 12462.1 12782.2 12844.7 12308.3 12328.9 13236.1 13294.2 13299.8 10653.6 11145.0 12754.7 12792.0 13027.8 10106.9 10291.4 10392.6 10516.9 10569.7 9462.8 9567.1 10261.5 10433.7 10484.5 09:38:09 INFO - PROCESS | 32163 | -------- Summary: end -------- 09:38:09 INFO - PROCESS | 32163 | 09:38:10 INFO - TEST-INFO | 32163: exit 0 09:38:10 INFO - TEST-OK | dromaeo_css | took 1107969ms 09:38:10 INFO - TEST-START | kraken 09:38:10 INFO - operating with platform_type : linux_ 09:38:10 INFO - Initialising browser for kraken test... 09:38:10 INFO - TEST-INFO | started process 32408 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpYppRyT/profile http://localhost:32961/getInfo.html) 09:38:14 INFO - PROCESS | 32408 | 09:38:14 INFO - PROCESS | 32408 | (process:32486): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 09:38:14 INFO - PROCESS | 32408 | __metrics Screen width/height:1600/1200 09:38:14 INFO - PROCESS | 32408 | colorDepth:24 09:38:14 INFO - PROCESS | 32408 | Browser inner width/height: 1024/697 09:38:14 INFO - PROCESS | 32408 | __metrics 09:38:15 INFO - TEST-INFO | 32408: exit 0 09:38:15 INFO - Browser initialized. 09:38:15 INFO - Running cycle 1/1 for kraken test... 09:38:15 INFO - TEST-INFO | started process 32534 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpYppRyT/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:38:17 INFO - PROCESS | 32534 | 09:38:17 INFO - PROCESS | 32534 | (process:32596): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 09:38:27 INFO - PROCESS | 32534 | RSS: Main: 138424320 09:38:27 INFO - PROCESS | 32534 | 09:38:30 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:32961/tests/kraken/driver.html?testName=audio-beat-detection) 09:38:30 INFO - PROCESS | 32534 | RSS: Main: 142319616 09:38:30 INFO - PROCESS | 32534 | 09:38:33 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:32961/tests/kraken/driver.html?testName=audio-dft) 09:38:33 INFO - PROCESS | 32534 | RSS: Main: 144027648 09:38:33 INFO - PROCESS | 32534 | 09:38:36 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:32961/tests/kraken/driver.html?testName=audio-fft) 09:38:37 INFO - PROCESS | 32534 | RSS: Main: 143654912 09:38:37 INFO - PROCESS | 32534 | 09:38:39 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:32961/tests/kraken/driver.html?testName=audio-oscillator) 09:38:40 INFO - PROCESS | 32534 | RSS: Main: 142905344 09:38:40 INFO - PROCESS | 32534 | 09:38:42 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:32961/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:38:42 INFO - PROCESS | 32534 | RSS: Main: 142741504 09:38:42 INFO - PROCESS | 32534 | 09:38:45 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:32961/tests/kraken/driver.html?testName=imaging-darkroom) 09:38:46 INFO - PROCESS | 32534 | RSS: Main: 142745600 09:38:46 INFO - PROCESS | 32534 | 09:38:49 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:32961/tests/kraken/driver.html?testName=imaging-desaturate) 09:38:50 INFO - PROCESS | 32534 | RSS: Main: 143011840 09:38:50 INFO - PROCESS | 32534 | 09:38:53 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:32961/tests/kraken/driver.html?testName=json-parse-financial) 09:38:53 INFO - PROCESS | 32534 | RSS: Main: 144007168 09:38:53 INFO - PROCESS | 32534 | 09:38:55 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:32961/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:38:55 INFO - PROCESS | 32534 | RSS: Main: 142991360 09:38:55 INFO - PROCESS | 32534 | 09:38:57 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:32961/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:38:58 INFO - PROCESS | 32534 | RSS: Main: 143695872 09:38:58 INFO - PROCESS | 32534 | 09:39:00 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:32961/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:39:00 INFO - PROCESS | 32534 | RSS: Main: 144072704 09:39:00 INFO - PROCESS | 32534 | 09:39:03 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:32961/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:39:03 INFO - PROCESS | 32534 | RSS: Main: 145190912 09:39:03 INFO - PROCESS | 32534 | 09:39:06 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:32961/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:39:06 INFO - PROCESS | 32534 | RSS: Main: 144912384 09:39:06 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | Cycle 1(1): loaded http://localhost:32961/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:32961/tests/kraken/driver.html?testName=ai-astar) 09:39:08 INFO - PROCESS | 32534 | RSS: Main: 146042880 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | __start_tp_report 09:39:08 INFO - PROCESS | 32534 | _x_x_mozilla_page_load 09:39:08 INFO - PROCESS | 32534 | _x_x_mozilla_page_load_details 09:39:08 INFO - PROCESS | 32534 | |i|pagename|runs| 09:39:08 INFO - PROCESS | 32534 | |0;ai-astar;110;104;110;109;112;121;109;109;109;109 09:39:08 INFO - PROCESS | 32534 | |1;audio-beat-detection;154;125;154;160;128;155;152;133;170;128 09:39:08 INFO - PROCESS | 32534 | |2;audio-dft;163;164;163;162;163;163;162;162;168;162 09:39:08 INFO - PROCESS | 32534 | |3;audio-fft;75;76;76;156;76;74;75;80;163;76 09:39:08 INFO - PROCESS | 32534 | |4;audio-oscillator;97;96;138;94;96;98;136;95;95;143 09:39:08 INFO - PROCESS | 32534 | |5;imaging-gaussian-blur;109;110;110;110;109;111;110;110;110;110 09:39:08 INFO - PROCESS | 32534 | |6;imaging-darkroom;148;147;148;147;146;147;146;148;147;147 09:39:08 INFO - PROCESS | 32534 | |7;imaging-desaturate;99;97;96;96;97;96;98;96;96;96 09:39:08 INFO - PROCESS | 32534 | |8;json-parse-financial;61;64;64;62;62;65;63;62;63;59 09:39:08 INFO - PROCESS | 32534 | |9;json-stringify-tinderbox;63;64;64;64;64;64;64;65;68;65 09:39:08 INFO - PROCESS | 32534 | |10;stanford-crypto-aes;79;78;80;81;80;88;79;81;79;80 09:39:08 INFO - PROCESS | 32534 | |11;stanford-crypto-ccm;118;121;113;120;111;116;115;111;112;119 09:39:08 INFO - PROCESS | 32534 | |12;stanford-crypto-pbkdf2;135;130;133;138;138;133;135;135;146;133 09:39:08 INFO - PROCESS | 32534 | |13;stanford-crypto-sha256-iterative;64;66;65;64;69;65;65;65;65;68 09:39:08 INFO - PROCESS | 32534 | __end_tp_report 09:39:08 INFO - PROCESS | 32534 | __start_cc_report 09:39:08 INFO - PROCESS | 32534 | _x_x_mozilla_cycle_collect,715 09:39:08 INFO - PROCESS | 32534 | __end_cc_report 09:39:08 INFO - PROCESS | 32534 | __startTimestamp1459528748658__endTimestamp 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | ------- Summary: start ------- 09:39:08 INFO - PROCESS | 32534 | Number of tests: 14 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#0] ai-astar Cycles:10 Average:110.20 Median:109.50 stddev:4.29 (3.9%) stddev-sans-first:4.55 09:39:08 INFO - PROCESS | 32534 | Values: 110.0 104.0 110.0 109.0 112.0 121.0 109.0 109.0 109.0 109.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#1] audio-beat-detection Cycles:10 Average:145.90 Median:154.00 stddev:15.90 (10.3%) stddev-sans-first:16.59 09:39:08 INFO - PROCESS | 32534 | Values: 154.0 125.0 154.0 160.0 128.0 155.0 152.0 133.0 170.0 128.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#2] audio-dft Cycles:10 Average:163.20 Median:163.00 stddev:1.81 (1.1%) stddev-sans-first:1.92 09:39:08 INFO - PROCESS | 32534 | Values: 163.0 164.0 163.0 162.0 163.0 163.0 162.0 162.0 168.0 162.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#3] audio-fft Cycles:10 Average:92.70 Median:76.00 stddev:35.28 (46.4%) stddev-sans-first:36.83 09:39:08 INFO - PROCESS | 32534 | Values: 75.0 76.0 76.0 156.0 76.0 74.0 75.0 80.0 163.0 76.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#4] audio-oscillator Cycles:10 Average:108.80 Median:95.50 stddev:20.94 (21.9%) stddev-sans-first:21.77 09:39:08 INFO - PROCESS | 32534 | Values: 97.0 96.0 138.0 94.0 96.0 98.0 136.0 95.0 95.0 143.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#5] imaging-gaussian-blur Cycles:10 Average:109.90 Median:110.00 stddev:0.57 (0.5%) stddev-sans-first:0.50 09:39:08 INFO - PROCESS | 32534 | Values: 109.0 110.0 110.0 110.0 109.0 111.0 110.0 110.0 110.0 110.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#6] imaging-darkroom Cycles:10 Average:147.10 Median:147.00 stddev:0.74 (0.5%) stddev-sans-first:0.71 09:39:08 INFO - PROCESS | 32534 | Values: 148.0 147.0 148.0 147.0 146.0 147.0 146.0 148.0 147.0 147.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#7] imaging-desaturate Cycles:10 Average:96.70 Median:96.50 stddev:1.06 (1.1%) stddev-sans-first:0.73 09:39:08 INFO - PROCESS | 32534 | Values: 99.0 97.0 96.0 96.0 97.0 96.0 98.0 96.0 96.0 96.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#8] json-parse-financial Cycles:10 Average:62.50 Median:63.00 stddev:1.72 (2.7%) stddev-sans-first:1.73 09:39:08 INFO - PROCESS | 32534 | Values: 61.0 64.0 64.0 62.0 62.0 65.0 63.0 62.0 63.0 59.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#9] json-stringify-tinderbox Cycles:10 Average:64.50 Median:64.00 stddev:1.35 (2.1%) stddev-sans-first:1.32 09:39:08 INFO - PROCESS | 32534 | Values: 63.0 64.0 64.0 64.0 64.0 64.0 64.0 65.0 68.0 65.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#10] stanford-crypto-aes Cycles:10 Average:80.50 Median:80.00 stddev:2.80 (3.5%) stddev-sans-first:2.92 09:39:08 INFO - PROCESS | 32534 | Values: 79.0 78.0 80.0 81.0 80.0 88.0 79.0 81.0 79.0 80.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#11] stanford-crypto-ccm Cycles:10 Average:115.60 Median:117.00 stddev:3.78 (3.2%) stddev-sans-first:3.91 09:39:08 INFO - PROCESS | 32534 | Values: 118.0 121.0 113.0 120.0 111.0 116.0 115.0 111.0 112.0 119.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:135.60 Median:135.00 stddev:4.38 (3.2%) stddev-sans-first:4.64 09:39:08 INFO - PROCESS | 32534 | Values: 135.0 130.0 133.0 138.0 138.0 133.0 135.0 135.0 146.0 133.0 09:39:08 INFO - PROCESS | 32534 | 09:39:08 INFO - PROCESS | 32534 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.60 Median:65.00 stddev:1.65 (2.5%) stddev-sans-first:1.64 09:39:08 INFO - PROCESS | 32534 | Values: 64.0 66.0 65.0 64.0 69.0 65.0 65.0 65.0 65.0 68.0 09:39:08 INFO - PROCESS | 32534 | -------- Summary: end -------- 09:39:08 INFO - PROCESS | 32534 | 09:39:09 INFO - TEST-INFO | 32534: exit 0 09:39:09 INFO - TEST-OK | kraken | took 59056ms 09:39:09 INFO - TEST-START | v8_7 09:39:09 INFO - operating with platform_type : linux_ 09:39:09 INFO - Initialising browser for v8_7 test... 09:39:09 INFO - TEST-INFO | started process 355 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpa6crnE/profile http://localhost:32961/getInfo.html) 09:39:13 INFO - PROCESS | 355 | 09:39:13 INFO - PROCESS | 355 | (process:438): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 09:39:13 INFO - PROCESS | 355 | __metrics Screen width/height:1600/1200 09:39:13 INFO - PROCESS | 355 | colorDepth:24 09:39:13 INFO - PROCESS | 355 | Browser inner width/height: 1024/697 09:39:13 INFO - PROCESS | 355 | __metrics 09:39:14 INFO - TEST-INFO | 355: exit 0 09:39:14 INFO - Browser initialized. 09:39:14 INFO - Running cycle 1/1 for v8_7 test... 09:39:14 INFO - TEST-INFO | started process 486 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpa6crnE/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:39:16 INFO - PROCESS | 486 | 09:39:16 INFO - PROCESS | 486 | (process:549): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 09:39:26 INFO - PROCESS | 486 | RSS: Main: 138051584 09:39:26 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | Cycle 1(1): loaded http://localhost:32961/tests/v8_7/run.html (next: http://localhost:32961/tests/v8_7/run.html) 09:39:49 INFO - PROCESS | 486 | RSS: Main: 141570048 09:39:49 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | __start_tp_report 09:39:49 INFO - PROCESS | 486 | _x_x_mozilla_page_load 09:39:49 INFO - PROCESS | 486 | _x_x_mozilla_page_load_details 09:39:49 INFO - PROCESS | 486 | |i|pagename|runs| 09:39:49 INFO - PROCESS | 486 | |0;Richards;165.6726308813784 09:39:49 INFO - PROCESS | 486 | |1;DeltaBlue;170.1837985023826 09:39:49 INFO - PROCESS | 486 | |2;Encrypt;280.74115665356544 09:39:49 INFO - PROCESS | 486 | |3;Decrypt;5263.1578947368425 09:39:49 INFO - PROCESS | 486 | |4;RayTrace;938.0863039399625 09:39:49 INFO - PROCESS | 486 | |5;Earley;557.7244841048522 09:39:49 INFO - PROCESS | 486 | |6;Boyer;10902.173913043478 09:39:49 INFO - PROCESS | 486 | |7;RegExp;39549.01960784314 09:39:49 INFO - PROCESS | 486 | |8;Splay;513.083632632119 09:39:49 INFO - PROCESS | 486 | |9;NavierStokes;4840.579710144928 09:39:49 INFO - PROCESS | 486 | __end_tp_report 09:39:49 INFO - PROCESS | 486 | __startTimestamp1459528789263__endTimestamp 09:39:49 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | ------- Summary: start ------- 09:39:49 INFO - PROCESS | 486 | Number of tests: 10 09:39:49 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | [#0] Richards Cycles:1 Average:165.67 Median:165.67 stddev:0.00 (0.0%) 09:39:49 INFO - PROCESS | 486 | Values: 165.7 09:39:49 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | [#1] DeltaBlue Cycles:1 Average:170.18 Median:170.18 stddev:0.00 (0.0%) 09:39:49 INFO - PROCESS | 486 | Values: 170.2 09:39:49 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | [#2] Encrypt Cycles:1 Average:280.74 Median:280.74 stddev:0.00 (0.0%) 09:39:49 INFO - PROCESS | 486 | Values: 280.7 09:39:49 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | [#3] Decrypt Cycles:1 Average:5263.16 Median:5263.16 stddev:0.00 (0.0%) 09:39:49 INFO - PROCESS | 486 | Values: 5263.2 09:39:49 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | [#4] RayTrace Cycles:1 Average:938.09 Median:938.09 stddev:0.00 (0.0%) 09:39:49 INFO - PROCESS | 486 | Values: 938.1 09:39:49 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | [#5] Earley Cycles:1 Average:557.72 Median:557.72 stddev:0.00 (0.0%) 09:39:49 INFO - PROCESS | 486 | Values: 557.7 09:39:49 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | [#6] Boyer Cycles:1 Average:10902.17 Median:10902.17 stddev:0.00 (0.0%) 09:39:49 INFO - PROCESS | 486 | Values: 10902.2 09:39:49 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | [#7] RegExp Cycles:1 Average:39549.02 Median:39549.02 stddev:0.00 (0.0%) 09:39:49 INFO - PROCESS | 486 | Values: 39549.0 09:39:49 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | [#8] Splay Cycles:1 Average:513.08 Median:513.08 stddev:0.00 (0.0%) 09:39:49 INFO - PROCESS | 486 | Values: 513.1 09:39:49 INFO - PROCESS | 486 | 09:39:49 INFO - PROCESS | 486 | [#9] NavierStokes Cycles:1 Average:4840.58 Median:4840.58 stddev:0.00 (0.0%) 09:39:49 INFO - PROCESS | 486 | Values: 4840.6 09:39:49 INFO - PROCESS | 486 | -------- Summary: end -------- 09:39:49 INFO - PROCESS | 486 | 09:39:50 INFO - TEST-INFO | 486: exit 0 09:39:50 INFO - TEST-OK | v8_7 | took 40549ms 09:39:50 INFO - SUITE-END | took 1207s 09:39:50 INFO - Completed test suite (00:20:07) 09:39:50 INFO - Working with test: dromaeo_css 09:39:50 INFO - Generating results file: dromaeo_css 09:39:50 INFO - Working with test: kraken 09:39:50 INFO - Generating results file: kraken 09:39:50 INFO - javascript benchmark 09:39:50 INFO - Working with test: v8_7 09:39:50 INFO - Generating results file: v8_7 09:39:50 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:39:50 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,53,43]] 09:39:50 INFO - process_Request line: dromaeo_css 7248.55 graph.html#tests=[[72,53,43]] 09:39:50 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:39:50 INFO - process_Request line: kraken 1498.80 graph.html#tests=[[232,53,43]] 09:39:50 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:39:50 INFO - process_Request line: v8_7 22040.40 graph.html#tests=[[230,53,43]] 09:39:50 INFO - RETURN: dromaeo_css: 7248.55 09:39:50 INFO - RETURN: kraken: 1498.80 09:39:50 INFO - RETURN: v8_7: 22040.40 09:39:50 INFO - javascript benchmark 09:39:50 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3200.423923693735, 3259.7881137726044, 3282.031800618817, 3288.9671103288974, 3300.8844690435826, 5251.02855971645, 5289.153735402331, 5298.814541491049, 5303.496167864057, 5344.625876188668, 5257.36911570612, 5292.417834038262, 5292.497212764791, 5300.708461034642, 5307.071262529052, 4828.058528586918, 4888.022395520892, 4892.461829198785, 4894.461609223001, 4913.70517768935, 4802.543758342952, 4921.064997650435, 4950.6287028472825, 4960.181570040939, 5024.723640199788, 4921.237208232712, 4966.329545511364, 4972.453030166679, 4975.800967961295, 4977.153883839738, 4855.126077306083, 4882.951170488285, 4915.410150781929, 4924.0, 4938.975305123469, 4742.573168414825, 4751.097291514601, 4795.304680821261, 4809.0, 4860.100881336929, 5110.565601923841, 5120.743962801882, 5141.151709967889, 5142.9228561571235, 5206.349206349207, 5698.601097923147, 5707.343655479632, 5710.77156913723, 5711.228984087178, 5715.771369145229, 5651.689157096358, 5676.574256930747, 5705.971470142665, 5731.168980497804, 5733.397993210695, 5458.699771512565, 5464.26232458617, 5466.34403871534, 5473.8357849264585, 5473.863153421156, 5867.413258674099, 5910.645361278337, 5911.0, 5917.230760001258, 5929.792457264061, 5596.832095037155, 5651.378348381675, 5654.85862853432, 5687.260656114761, 5711.257536520309, 5738.340090889517, 5760.711964401763, 5762.337331206965, 5784.132380142928, 5786.07422812348, 5688.06146985751, 5703.828885133453, 5711.628744131618, 5719.8570035749435, 5725.227094342211, 5634.985702573576, 5662.320521537442, 5669.064604340238, 5734.455226753452, 5779.88440231193, 4395.099004704028, 4399.692021558524, 4412.918834885473, 4416.492103408149, 4438.911221775611, 3905.2384784967226, 3977.105151340983, 3984.3425834737523, 3987.8205480753436, 4005.6595189408645, 5387.111126664135, 5454.618176727591, 5502.504774570308, 5509.752061157257, 5551.528120109755, 5688.260526131577, 5750.2524671793235, 5753.252077229933, 5767.336756272998, 5776.306843178845, 5347.759350829222, 5360.946390536123, 5432.185172224198, 5435.864103397446, 5441.428649991773, 4964.081644895706, 5018.096742586296, 5020.297158397827, 5032.194848824171, 5073.543381095719, 5857.648541087548, 5860.09168578871, 5898.498627616615, 5908.911366329508, 5914.645121292736, 5640.0693885508435, 5746.482816546447, 5757.740901659519, 5764.682942438206, 5797.1304304353, 5915.201447804491, 5925.674087925206, 5937.435943585352, 5960.0761881908375, 5974.253218347707, 5647.774089036392, 5663.0, 5715.514181294637, 5722.0844664855085, 5739.71301434935, 5660.405657406078, 5772.711364431846, 5773.971130144322, 5778.133280008033, 5820.388859169726, 5647.830565083054, 5683.033884239607, 5694.743736531949, 5707.029804933254, 5729.570282228766, 5564.638298510584, 5564.8330550083565, 5568.721563921868, 5569.832905012856, 5569.972150139223, 5475.5072043516275, 5492.670439773627, 5500.147477141049, 5546.140348246028, 5577.44225577439, 5537.0, 5542.224088627676, 5589.916151257653, 5600.663960162403, 5615.241942337732, 5403.972980135074, 5467.9453205467435, 5472.20653005304, 5491.039068162976, 5524.254225679642], "unit": "score", "name": "dojo.html", "value": 5296.2130985599715}, {"lowerIsBetter": false, "replicates": [544.4990608640051, 556.7772890843663, 561.7612514681259, 577.9595428320018, 583.4661284924294, 29799.702002979964, 30471.542926856087, 36989.0, 37022.25955480889, 37062.81468592653, 40580.0, 40946.385804212885, 40985.79507102468, 41089.58910410895, 41168.0, 8791.384603077771, 9095.954520227422, 9131.771705707344, 9132.680356187535, 9134.223590994774, 8807.559622018873, 8943.552822358888, 8995.550222488882, 8999.100089990981, 9005.909940900572, 8892.15524525169, 9006.369554131214, 9039.548022598843, 9049.411788233743, 9057.365984381096, 8873.778155546099, 9003.684871029482, 9024.548772561378, 9030.819383612292, 9039.367244292902, 8767.605457754416, 8999.775005624846, 9003.369764116514, 9005.0, 9022.819543609092, 41037.0, 41081.1783764326, 41257.38113928294, 41327.0, 41462.585374146176, 3491.965080349215, 3637.727170462226, 3665.9083522911874, 3915.353966595508, 3993.341098718708, 32679.346413071606, 32769.6723032769, 33019.83490082534, 33104.3379132416, 33230.667693323, 3627.8548858045647, 3676.4228535473508, 3699.130704284491, 3706.4440333949856, 3726.81365931705, 224611.0, 226304.0, 226338.0, 226529.86735066384, 227935.0, 45241.321380179324, 45829.7708511462, 45839.0, 45985.540144598795, 46048.769756151676, 44041.559584404386, 44447.0, 44487.777561112634, 44516.55483445189, 44557.777211114386, 16750.413735519443, 16836.74744878803, 16838.410655627238, 16872.831271687126, 16874.0, 13832.30838458073, 13884.4446222152, 13890.652733681738, 13999.440022399194, 14027.158370497802, 15434.151121688416, 15488.14815185153, 15523.37906483728, 15659.686806263811, 15689.0, 6010.549208809357, 6056.3338032816355, 6163.075538669235, 6183.474404675563, 6237.251529816361, 1095.386583513235, 1105.8617672790901, 1108.545496346494, 1113.276370359273, 1127.5546159267044, 29180.854095729384, 29250.853745731136, 29332.826686932283, 29634.703652963195, 29746.40507189844, 1125.9662210133708, 1178.6699724077273, 1179.7994340962057, 1239.2997956154743, 1253.9059570532247, 15246.618834529003, 15352.385904563916, 15429.614259643375, 15565.0, 15577.454789082327, 345636.0, 522911.0, 528452.0, 530599.0, 545992.0, 53980.73009635005, 54733.0, 54760.452395475535, 54789.726051369486, 54943.45056549463, 1497.2513743128436, 1514.0839791925946, 1517.8785697144424, 1518.8177418709824, 1526.6259766357314, 30384.544231836982, 30636.540451893685, 31012.0, 31183.53224701586, 31441.685583143877, 48414.0, 48789.51210487992, 49071.0, 49194.508054918995, 49204.75397622989, 328833.0, 331418.0, 331675.0, 331819.0, 332127.0, 33882.37409353389, 34678.479822802175, 35037.0, 35056.47415288722, 35085.122871928404, 45730.0, 45891.31163032624, 45910.0, 45915.54084459112, 46922.29616555686, 39415.21169576535, 39418.0, 39996.20007599774, 40433.39349909695, 40801.38797918093, 38955.61044389633, 39071.80464097775, 39363.60636393599, 39599.40600891047, 39749.403758944216, 40266.5840049598, 40789.592104078576, 41071.17857642771, 41279.58720412757, 41710.1657966845, 30934.69065309318, 31092.533611995386, 32045.519317209793, 32601.510977335834, 32792.0, 26635.86682066577, 27529.174124776287, 27568.172954811387, 27604.723952760214, 27656.0], "unit": "score", "name": "ext.html", "value": 18963.09360249869}, {"lowerIsBetter": false, "replicates": [383.97120215983807, 384.12228058885444, 387.73827666325235, 388.5628667748783, 391.69643526267157, 15520.922395388006, 16419.0, 17065.744013839772, 19085.332013379517, 19089.0, 11647.6505704829, 12019.7596048079, 12091.153619246656, 17117.40089096882, 17888.910555447237, 4990.276409920569, 5034.446210916796, 5142.382914050319, 5156.458571849958, 6325.715342809584, 5397.568194544427, 5596.132599447093, 5602.60781745278, 5630.042892708249, 6214.627122372672, 5440.0, 5577.721113944307, 5630.7184640768, 5638.379778224392, 5657.462541058593, 5446.945530544704, 5580.330360356763, 5649.265595472603, 5888.970555147197, 5943.940560594382, 5766.279215098113, 5770.04794208955, 5777.971110144465, 5787.623804452697, 5803.506701930341, 19294.71057934132, 19464.513387165433, 20082.397528074034, 20472.0, 20553.69169462459, 2265.29775769512, 2285.394370491821, 2288.485090854561, 2289.461976435536, 2296.4144143243366, 10360.067593916583, 10409.843852342221, 13308.800367994489, 14076.366563504667, 14079.0, 1895.4218963216213, 2001.2195243854908, 2053.8254248388903, 2076.5223998480433, 2148.4091874734418, 52769.73615131938, 53648.73175634097, 54078.18882716762, 55064.72467637636, 62921.370786292006, 10973.231873768918, 11152.330860148417, 11259.943700281447, 11278.436078196057, 11281.435928203557, 14223.28883555818, 14929.0, 15085.924570377078, 15159.545213643609, 15161.0, 8411.915880841236, 8627.22354988054, 8772.78068048304, 8813.691520796741, 8825.02924678285, 8579.2707619853, 8601.870971935426, 8602.18279263469, 8602.31181505478, 8632.266257368194, 4618.607418369409, 4775.498572649891, 4849.830255941025, 4855.465898751135, 4885.0, 2032.3394896658644, 2057.5473395852887, 2067.648499755045, 2073.8237249833633, 2094.759102703178, 1013.2957594471771, 1041.0890470838017, 1060.7772367802693, 1072.4852071005805, 1088.8584484017026, 16986.405475808286, 17677.166535043405, 17692.115394230237, 17761.289548418175, 18165.0, 945.9006804285589, 999.2305924438142, 1049.884512703602, 1070.0957690751459, 1091.645215305029, 9294.488803115759, 9441.90558094424, 9472.242220622335, 9505.572249248662, 9720.75698107553, 512431.0, 524875.0, 524968.0, 548170.0, 603536.0, 47375.0, 47952.04095918132, 48132.5186748135, 81101.18898811055, 82538.17461825426, 1204.373725662668, 1247.2516490106045, 1248.4631608408472, 1254.1095821966323, 1255.2029461291963, 16054.759178612096, 16220.51338459848, 16374.83625163733, 16446.342146314015, 16564.254608542404, 32440.0, 33494.665053349156, 33847.0, 34261.143471413416, 34368.312633747686, 43595.78202108969, 44343.556564433944, 45286.54713452955, 45740.0, 46004.7699761499, 7658.349040331635, 7801.258880406353, 7828.882566761617, 8034.236747508978, 8139.18608139205, 11344.659660210207, 11682.182247242612, 11751.118666099906, 11936.880631193577, 11949.701257468632, 9551.42691438516, 10003.449810260505, 10205.38767673942, 10309.175265978854, 10384.169266458513, 10068.647597334351, 10491.702153062577, 10998.615048473264, 11022.669319920415, 11089.946455086754, 3106.7048630380077, 3142.827144507074, 7829.277558937025, 9781.804363912825, 10232.0, 8342.08237093907, 8355.164483551596, 8438.324934005142, 8459.788505287417, 8483.787905302417, 9062.275017998412, 10948.0, 10967.725806854893, 10984.725381865517, 11120.332780033224], "unit": "score", "name": "jquery.html", "value": 8625.318437617414}, {"lowerIsBetter": false, "replicates": [1510.305259580593, 1516.9089854608728, 1687.4178408449088, 1818.1727314072098, 1839.8896066236034, 7998.880016799752, 8024.398170137241, 8117.107118217006, 8206.794830129249, 8217.219364160403, 8030.116687164422, 8034.678612855479, 8147.9592602037055, 8160.836783264331, 8241.752747417571, 2417.480241748028, 2438.6585877977095, 2444.841085329448, 2451.1421002649017, 2454.447749256421, 2288.141946769961, 2408.1330720940537, 2435.7077150741934, 2451.669024681672, 2453.6442215878687, 2352.4001379648253, 2406.7111946566347, 2420.4190994161363, 2422.358075110097, 2424.248482970285, 2417.9361081124425, 2450.0567281596536, 2452.043702955849, 2478.3184624228393, 2482.2925466242214, 2411.9758802411925, 2445.8165637577254, 2450.47314827313, 2455.3861534616344, 2458.6312053191987, 8021.5989200540325, 8061.95969020157, 8089.110197878229, 8094.433389662726, 8114.797130071736, 4918.188498897677, 5065.493450654942, 5088.796448142107, 5097.184450487941, 5109.770060347293, 2903.738663520272, 2971.435427268834, 2982.075556577468, 3012.548117782328, 3031.6513600935955, 994.7612572982505, 1007.2948935745007, 1013.7668336282622, 1022.4989755020061, 1064.6912395405323, 11182.832257516144, 11260.887391126147, 11282.717932051764, 11284.040856527123, 11304.69995950468, 4293.699441039097, 4314.395984562164, 4355.60799528044, 4440.489343725449, 4461.996050888589, 9097.77255568616, 9110.81778364429, 9127.452352858849, 9134.954325228331, 9138.68014619485, 4999.650024498323, 5028.673136246205, 5034.11902916988, 5051.747412629354, 5053.014662140848, 4609.124266389375, 4644.465886423037, 4659.184642687516, 4673.018666080094, 4683.95316046842, 3598.226381328027, 3696.1129328960856, 3707.277080969185, 3708.2768860072565, 3722.106694393326, 1099.2689861242345, 1100.4442756408123, 1101.603422767819, 1101.8292164714483, 1151.8329842172839, 1229.1580267516779, 1234.623439850854, 1312.2454588611586, 1433.956981290563, 1469.169918995764, 7750.0699916010435, 7831.921680783119, 7988.16124306951, 8007.599620018976, 8029.759107226792, 1209.7580483903255, 1226.3806777577445, 1230.1081715756184, 1232.6240496648609, 1240.838690970168, 6195.132681424604, 6199.225096862892, 6241.531885108635, 6248.28144763349, 6259.123722678829, 9531.809363812685, 9790.510474476248, 9818.80362392748, 9828.410295382157, 10036.598536058476, 9807.166390856715, 9939.950300248453, 9943.055409736064, 9992.150667193224, 10049.748756281151, 7399.408047356199, 7429.517081389692, 7439.776806695808, 7441.479096463304, 7514.624268786539, 7529.1717911028645, 7572.659230334538, 7608.01095857535, 7680.423968202519, 7702.268284512962, 8665.17680820321, 8858.247049000649, 8887.822243555222, 8899.822003559762, 8998.14517620825, 8983.505907175168, 9030.683926062557, 9032.638694452411, 9074.274058075207, 9423.340366174301, 7091.539049961736, 7167.964160179165, 7169.426445884421, 7175.892361614476, 7178.066851309296, 7516.586587737727, 7690.461667683208, 7712.691492340244, 7718.807029824299, 7802.570858602604, 7176.677049532679, 7225.349718525358, 7319.414446844133, 7320.377767889789, 7345.0084238627105, 7277.417806575567, 7317.67070481819, 7420.517666351886, 7463.104427468738, 7515.736949206752, 7434.628268586441, 7553.773386798405, 7578.962105189439, 7664.425168112302, 7666.2333766625125, 6895.448364130958, 6895.793126206222, 6901.068355772108, 6909.136357955255, 6941.409980151744, 6890.793276201722, 6906.0, 6937.687804048931, 6953.687084081127, 7093.32613401726], "unit": "score", "name": "mootools.html", "value": 4729.147623351062}, {"lowerIsBetter": false, "replicates": [355.2929669956786, 365.1747051663241, 367.69297636473544, 369.41816638793887, 373.65250317205005, 6366.2360516738, 6409.391107844753, 6485.546011779177, 6488.610683359002, 6598.901016484757, 6426.582272152307, 6471.288158302583, 6482.513811464136, 6492.7402903883785, 6496.350364963513, 4861.0, 4865.318855360252, 4875.390576177978, 4876.512348765131, 4890.975545122269, 4882.731449770279, 4894.8286809961655, 4896.755162241891, 4897.338859254009, 4910.386201724785, 4766.880827979294, 4809.206480930642, 4887.8778030549165, 4888.169011268093, 4899.3385892904535, 4849.709017458946, 4875.8781030474165, 4877.073356062355, 4881.1213981483315, 4889.608831293488, 4322.697411181219, 4330.805113769888, 4336.544662810423, 4337.7397356158735, 4342.348647702838, 6059.636421814661, 6065.727042283108, 6071.150038994544, 6071.998120310143, 6072.2713274406915, 5573.944260557383, 5682.204491371212, 5726.3700992890745, 5782.392848750863, 5801.593888427812, 6837.0, 6846.554973926679, 6849.691763870638, 6850.794476165723, 6863.931360686379, 4806.951930480685, 4820.035992801454, 4821.37322148122, 4827.227643577011, 4836.830710925136, 7023.086998690189, 7089.397401220851, 7174.282571742836, 7180.5691658500655, 7184.928150718531, 4900.436449808318, 4902.852914412502, 4905.484924082992, 4905.8037678492465, 4923.729194894315, 4978.551930326288, 4982.5515703586125, 4986.326845875833, 4986.601071914238, 4996.250562415594, 5729.942700573024, 5746.798862039808, 5750.712464376765, 5755.309362876398, 5758.856028599234, 6666.200055993312, 6814.1482314710665, 6827.795166145023, 6901.723931042702, 6905.067815844897, 1724.2413338131432, 1730.108993868159, 1734.9045802480732, 1741.7648617436485, 1745.860331173503, 1180.8523934508187, 1183.2722875431548, 1196.282230661596, 1208.5165933626445, 1211.0130243851409, 6607.57050791697, 6631.602103873783, 6684.699188536528, 6734.158230221223, 6754.864902701918, 7037.577745335297, 7122.501424900311, 7135.607541585159, 7160.749373771893, 7162.570245785269, 6499.155109835691, 6645.401913827779, 6694.230163531159, 6722.058911752359, 6728.0, 3839.9232015359535, 3843.404272337736, 3880.8835734927434, 3881.359575669983, 3888.047428380065, 7315.0, 7325.816854578678, 7342.3758980487255, 7370.520916140541, 7389.704411823574, 7216.025836512109, 7343.963280183565, 7376.077990251219, 7392.223816499298, 7405.074365704287, 7385.372243359375, 7400.555966642019, 7402.296781805828, 7408.592527411044, 7412.110546734426, 6898.172219333512, 7143.321384468467, 7147.0, 7165.892511612435, 7181.676824543013, 6996.965015174892, 7002.7899163025195, 7050.2597227292445, 7102.254263302279, 7113.82215444618, 7362.558246505227, 7363.263673632594, 7370.815729606588, 7376.0, 7392.630368481447, 4844.224924012141, 4858.416989961227, 4901.730404827768, 4911.263310503453, 4918.704877707206, 7146.606936618328, 7172.995780590617, 7176.318249766473, 7192.856142877218, 7207.522457896223, 6961.477889158232, 6972.825679358057, 6986.47601429905, 6987.545809522569, 6991.720331186695, 6742.898856517254, 6963.1296087989, 6976.895346569907, 6984.441244700513, 6991.0, 6858.451323893977, 6870.351115732288, 6870.519063665495, 6882.380585747307, 6883.242843287335, 6985.5808651481075, 6987.860242795217, 7006.2643422439905, 7008.983697363752, 7025.543339682904, 6682.298358672269, 6820.897686534805, 6822.658867056726, 6822.829429264308, 6841.24746277919], "unit": "score", "name": "prototype.html", "value": 5204.263483714974}, {"lowerIsBetter": false, "replicates": [864.9610767515462, 931.5063016601199, 933.5378987401238, 939.4222553129825, 963.2438535749438, 16779.328826846926, 17063.06153161577, 17081.060541670202, 17098.743518847226, 17137.0, 15415.92292038541, 15518.068915865057, 15518.224088795543, 15537.223138843041, 15605.609859753511, 883.3286702106413, 888.0852721696663, 908.0510866144895, 910.3900386740867, 914.9588268527932, 899.5052721003455, 904.5567671840784, 906.8095699903029, 909.7680091576639, 910.0444533240104, 947.8056998315329, 947.9099485548896, 948.340903072365, 948.7153853843854, 954.5704433005141, 935.1490143968989, 939.3096074385321, 940.3511577011908, 941.0589410589411, 946.7396465971879, 695.93736563709, 698.0715648187949, 699.4823830365493, 701.5264696330008, 701.6000879498688, 14274.357653905496, 14291.285435728172, 14353.0, 14371.640708982255, 14391.0, 13527.594172174851, 13745.24401157936, 13752.65618359539, 13846.723065538632, 14053.578392648236, 11390.658280251606, 11428.657140285804, 11665.475053622607, 11760.941195294054, 11941.0, 3953.9802300988313, 4007.479027726406, 4008.098177909976, 4043.878683639466, 4085.20338533986, 52564.0, 52609.736951315, 52680.47319526794, 52841.0, 52988.47011529874, 10279.897201027894, 10455.68632941013, 10608.734781630366, 10803.729906752395, 10905.890941090645, 19022.714659280122, 19043.42869713911, 19069.046547672562, 19104.61790764177, 19188.13653385601, 7807.18024607408, 7840.215978402114, 7988.680452781824, 8112.797180070545, 8225.054118776297, 4600.263957766741, 4610.077984403133, 4629.1436084324505, 4648.093621743727, 4689.273162659793, 3046.2993511492036, 3048.1465189746905, 3055.220918665726, 3061.7856750027286, 3063.172943305295, 546.1916363781626, 558.4136656510648, 561.9325680918234, 565.0535353283316, 565.1945976982784, 646.1890327638783, 650.1385663995226, 658.558765627031, 665.012456502094, 682.9009793579903, 8666.610002549774, 8886.777830554158, 8969.50667713282, 9126.0, 9149.862752058725, 592.8547505861092, 656.9310222426576, 678.7714237230629, 682.2358957967109, 753.8605358008676, 4092.2838503262406, 4127.8968025798995, 4164.583541645811, 4194.6853985951175, 4226.661867050629, 54284.18573721397, 55362.72318638381, 55633.0, 55724.72137639286, 55815.0, 53090.46909530932, 54768.17847732287, 56359.43640563542, 56402.71798640981, 56459.43540564624, 48097.75951120292, 48527.75736121297, 49136.75431622819, 49195.0, 49826.501734982914, 8201.671933122609, 8211.507309561446, 8236.588170591327, 8238.62511384766, 8307.750767476986, 34194.14514637154, 34237.315253695284, 35368.0, 35387.115322117155, 35972.64027359693, 42757.57242427536, 43956.34065489084, 48356.51643483661, 48362.75818621025, 52399.594026388164, 11387.202895797214, 11525.0, 12271.938640306742, 12592.307423091817, 12856.614301570968, 13865.722685546434, 14086.788698169741, 14161.858381416054, 14566.708665826412, 14978.026428282563, 12396.256224626552, 12452.501899923902, 12462.127651064338, 12782.169159004636, 12844.743105137659, 12308.26150430977, 12328.876711232773, 13236.13965092266, 13294.20234785916, 13299.80050299227, 10653.627123050655, 11144.996950274513, 12754.744905101661, 12792.0, 13027.804582931452, 10106.949465252626, 10291.382517049002, 10392.636257731245, 10516.894831051592, 10569.67879015123, 9462.810743785223, 9567.138957493858, 10261.538230779783, 10433.686989390331, 10484.528196231035], "unit": "score", "name": "yui.html", "value": 6802.666121283653}], "name": "dromaeo_css", "value": 7248.547577218469}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 104.0, 110.0, 109.0, 112.0, 121.0, 109.0, 109.0, 109.0, 109.0], "unit": "score", "name": "ai-astar", "value": 110.2}, {"lowerIsBetter": true, "replicates": [154.0, 125.0, 154.0, 160.0, 128.0, 155.0, 152.0, 133.0, 170.0, 128.0], "unit": "score", "name": "audio-beat-detection", "value": 145.9}, {"lowerIsBetter": true, "replicates": [163.0, 164.0, 163.0, 162.0, 163.0, 163.0, 162.0, 162.0, 168.0, 162.0], "unit": "score", "name": "audio-dft", "value": 163.2}, {"lowerIsBetter": true, "replicates": [75.0, 76.0, 76.0, 156.0, 76.0, 74.0, 75.0, 80.0, 163.0, 76.0], "unit": "score", "name": "audio-fft", "value": 92.7}, {"lowerIsBetter": true, "replicates": [97.0, 96.0, 138.0, 94.0, 96.0, 98.0, 136.0, 95.0, 95.0, 143.0], "unit": "score", "name": "audio-oscillator", "value": 108.8}, {"lowerIsBetter": true, "replicates": [109.0, 110.0, 110.0, 110.0, 109.0, 111.0, 110.0, 110.0, 110.0, 110.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.9}, {"lowerIsBetter": true, "replicates": [148.0, 147.0, 148.0, 147.0, 146.0, 147.0, 146.0, 148.0, 147.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 147.1}, {"lowerIsBetter": true, "replicates": [99.0, 97.0, 96.0, 96.0, 97.0, 96.0, 98.0, 96.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.7}, {"lowerIsBetter": true, "replicates": [61.0, 64.0, 64.0, 62.0, 62.0, 65.0, 63.0, 62.0, 63.0, 59.0], "unit": "score", "name": "json-parse-financial", "value": 62.5}, {"lowerIsBetter": true, "replicates": [63.0, 64.0, 64.0, 64.0, 64.0, 64.0, 64.0, 65.0, 68.0, 65.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.5}, {"lowerIsBetter": true, "replicates": [79.0, 78.0, 80.0, 81.0, 80.0, 88.0, 79.0, 81.0, 79.0, 80.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.5}, {"lowerIsBetter": true, "replicates": [118.0, 121.0, 113.0, 120.0, 111.0, 116.0, 115.0, 111.0, 112.0, 119.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 115.6}, {"lowerIsBetter": true, "replicates": [135.0, 130.0, 133.0, 138.0, 138.0, 133.0, 135.0, 135.0, 146.0, 133.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 135.6}, {"lowerIsBetter": true, "replicates": [64.0, 66.0, 65.0, 64.0, 69.0, 65.0, 65.0, 65.0, 65.0, 68.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 65.6}], "name": "kraken", "value": 1498.7999999999997}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [165.6726308813784], "unit": "score", "name": "Richards", "value": 213.0828719999999}, {"lowerIsBetter": false, "replicates": [170.1837985023826], "unit": "score", "name": "DeltaBlue", "value": 388.5093679999998}, {"lowerIsBetter": false, "replicates": [280.74115665356544], "unit": "score", "name": "Encrypt", "value": 948.136722}, {"lowerIsBetter": false, "replicates": [5263.1578947368425], "unit": "score", "name": "Decrypt", "value": 50.57439}, {"lowerIsBetter": false, "replicates": [938.0863039399625], "unit": "score", "name": "RayTrace", "value": 788.8282739999999}, {"lowerIsBetter": false, "replicates": [557.7244841048522], "unit": "score", "name": "Earley", "value": 1194.968159}, {"lowerIsBetter": false, "replicates": [10902.173913043478], "unit": "score", "name": "Boyer", "value": 61.131202392821535}, {"lowerIsBetter": false, "replicates": [39549.01960784314], "unit": "score", "name": "RegExp", "value": 23.0343257312841}, {"lowerIsBetter": false, "replicates": [513.083632632119], "unit": "score", "name": "Splay", "value": 158.82595899999998}, {"lowerIsBetter": false, "replicates": [4840.579710144928], "unit": "score", "name": "NavierStokes", "value": 306.5748502994012}], "name": "v8_7", "value": 22040.40108723106}]} 09:39:50 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,53,43]]", "result": "22040.40"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,53,43]]", "result": "1498.80"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,53,43]]", "result": "7248.55"}}} 09:39:50 INFO - Return code: 0 09:39:50 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 09:39:50 INFO - # TBPL SUCCESS # 09:39:50 INFO - Running post-action listener: _resource_record_post_action 09:39:50 INFO - Running post-run listener: _resource_record_post_run 09:39:51 INFO - Total resource usage - Wall time: 1222s; CPU: 13.0%; Read bytes: 0; Write bytes: 461819904; Read time: 0; Write time: 294900 09:39:51 INFO - install - Wall time: 13s; CPU: 14.0%; Read bytes: 0; Write bytes: 235089920; Read time: 0; Write time: 199092 09:39:51 INFO - run-tests - Wall time: 1209s; CPU: 13.0%; Read bytes: 0; Write bytes: 226164736; Read time: 0; Write time: 95808 09:39:51 INFO - Running post-run listener: _upload_blobber_files 09:39:51 INFO - Blob upload gear active. 09:39:51 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 09:39:51 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 09:39:51 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-Beta', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 09:39:51 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-Beta -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 09:39:52 INFO - (blobuploader) - INFO - Open directory for files ... 09:39:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 09:39:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:39:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:39:53 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 09:39:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:39:53 INFO - (blobuploader) - INFO - Done attempting. 09:39:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 09:39:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:39:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:39:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 09:39:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:39:54 INFO - (blobuploader) - INFO - Done attempting. 09:39:54 INFO - (blobuploader) - INFO - Iteration through files over. 09:39:54 INFO - Return code: 0 09:39:54 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 09:39:54 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 09:39:54 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/9298d9bb229439d85588d3dfc83d184505a42c225b93a05afe764d9747c5b11327e0f44d2ca5b2a6bb27d6fb5a10bbec59c4f67035da6d4bffd62117a842bdf7", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/d49b0b23ea4944e136afad8b5cd7a6b91208ef03b09e12e1691b3c8a5775294995289010f8a406bc85b5c7f6c1db4c1f37a8d34a36f350b7f8fc514a26b37920"} 09:39:54 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 09:39:54 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 09:39:54 INFO - Contents: 09:39:54 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/9298d9bb229439d85588d3dfc83d184505a42c225b93a05afe764d9747c5b11327e0f44d2ca5b2a6bb27d6fb5a10bbec59c4f67035da6d4bffd62117a842bdf7", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/d49b0b23ea4944e136afad8b5cd7a6b91208ef03b09e12e1691b3c8a5775294995289010f8a406bc85b5c7f6c1db4c1f37a8d34a36f350b7f8fc514a26b37920"} 09:39:54 INFO - Running post-run listener: copy_logs_to_upload_dir 09:39:54 INFO - Copying logs to upload dir... 09:39:54 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 09:39:54 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1267.914443 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2016-04-01 09:39:54.031882) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-01 09:39:54.035697) ========= 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=00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631 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-Beta/sha512/9298d9bb229439d85588d3dfc83d184505a42c225b93a05afe764d9747c5b11327e0f44d2ca5b2a6bb27d6fb5a10bbec59c4f67035da6d4bffd62117a842bdf7", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/d49b0b23ea4944e136afad8b5cd7a6b91208ef03b09e12e1691b3c8a5775294995289010f8a406bc85b5c7f6c1db4c1f37a8d34a36f350b7f8fc514a26b37920"} build_url:https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011539 build_url: 'https://queue.taskcluster.net/v1/task/C1EDIGT6Ru237DyMUG1i5w/artifacts/public/build/firefox-46.0.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/9298d9bb229439d85588d3dfc83d184505a42c225b93a05afe764d9747c5b11327e0f44d2ca5b2a6bb27d6fb5a10bbec59c4f67035da6d4bffd62117a842bdf7", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/d49b0b23ea4944e136afad8b5cd7a6b91208ef03b09e12e1691b3c8a5775294995289010f8a406bc85b5c7f6c1db4c1f37a8d34a36f350b7f8fc514a26b37920"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-01 09:39:54.060657) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:39:54.061068) ========= 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=00204705a9daa57ed339a427000001b9-1459527262.596712-1346012631 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004518 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:39:54.145365) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-01 09:39:54.145677) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-01 09:39:54.145952) ========= ========= Total master_lag: 0.29 =========