builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-010 starttime: 1452762024.95 results: success (0) buildid: 20160113203226 builduid: 29f441d276314179ad302e0b54b38d93 revision: bc0334f3ea8d97905464ec64c95d8d2787e3fa3c ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:24.947354) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:24.947788) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:24.948086) ========= 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=eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006231 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:24.970957) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:24.971329) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:24.984646) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:24.984922) ========= 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=eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004593 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.034075) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.034444) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.034818) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.035133) ========= 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=eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-14 01:00:25-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 35.3M=0s 2016-01-14 01:00:25 (35.3 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.161985 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.214543) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.214815) ========= 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=eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016914 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.263833) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.264192) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev bc0334f3ea8d97905464ec64c95d8d2787e3fa3c --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev bc0334f3ea8d97905464ec64c95d8d2787e3fa3c --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=eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-14 01:00:25,714 truncating revision to first 12 chars 2016-01-14 01:00:25,714 Setting DEBUG logging. 2016-01-14 01:00:25,714 attempt 1/10 2016-01-14 01:00:25,714 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/bc0334f3ea8d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-14 01:00:26,032 unpacking tar archive at: fx-team-bc0334f3ea8d/testing/mozharness/ program finished with exit code 0 elapsedTime=0.615486 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.892360) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.892665) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.902456) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.902754) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-14 01:00:25.903183) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 19 secs) (at 2016-01-14 01:00:25.903480) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 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', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 01:00:26 INFO - MultiFileLogger online at 20160114 01:00:26 in /builds/slave/test-pgo 01:00:26 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 01:00:26 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 01:00:26 INFO - {'append_to_log': False, 01:00:26 INFO - 'base_work_dir': '/builds/slave/test-pgo', 01:00:26 INFO - 'blob_upload_branch': 'Fx-Team', 01:00:26 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 01:00:26 INFO - 'branch': 'Fx-Team', 01:00:26 INFO - 'buildbot_json_path': 'buildprops.json', 01:00:26 INFO - 'config_files': ('talos/linux_config.py',), 01:00:26 INFO - 'default_actions': ('clobber', 01:00:26 INFO - 'read-buildbot-config', 01:00:26 INFO - 'download-and-extract', 01:00:26 INFO - 'populate-webroot', 01:00:26 INFO - 'create-virtualenv', 01:00:26 INFO - 'install', 01:00:26 INFO - 'run-tests'), 01:00:26 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 01:00:26 INFO - 'download_minidump_stackwalk': True, 01:00:26 INFO - 'download_symbols': 'ondemand', 01:00:26 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 01:00:26 INFO - 'tooltool.py': '/tools/tooltool.py', 01:00:26 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 01:00:26 INFO - '/tools/misc-python/virtualenv.py')}, 01:00:26 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 01:00:26 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 01:00:26 INFO - 'installer_path': 'installer.exe', 01:00:26 INFO - 'log_level': 'info', 01:00:26 INFO - 'log_name': 'talos', 01:00:26 INFO - 'log_to_console': True, 01:00:26 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 01:00:26 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 01:00:26 INFO - 'opt_config_files': (), 01:00:26 INFO - 'pip_index': False, 01:00:26 INFO - 'sps_profile': False, 01:00:26 INFO - 'sps_profile_interval': 0, 01:00:26 INFO - 'suite': 'dromaeojs-e10s', 01:00:26 INFO - 'system_bits': '32', 01:00:26 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 01:00:26 INFO - 'title': 'talos-linux64-ix-010', 01:00:26 INFO - 'tooltool_cache': '/builds/tooltool_cache', 01:00:26 INFO - 'use_talos_json': True, 01:00:26 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 01:00:26 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 01:00:26 INFO - 'work_dir': 'build'} 01:00:26 INFO - ##### 01:00:26 INFO - ##### Running clobber step. 01:00:26 INFO - ##### 01:00:26 INFO - Running pre-action listener: _resource_record_pre_action 01:00:26 INFO - Running main action method: clobber 01:00:26 INFO - rmtree: /builds/slave/test-pgo/build 01:00:26 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 01:00:26 INFO - Running post-action listener: _resource_record_post_action 01:00:26 INFO - ##### 01:00:26 INFO - ##### Running read-buildbot-config step. 01:00:26 INFO - ##### 01:00:26 INFO - Running pre-action listener: _resource_record_pre_action 01:00:26 INFO - Running main action method: read_buildbot_config 01:00:26 INFO - Using buildbot properties: 01:00:26 INFO - { 01:00:26 INFO - "project": "", 01:00:26 INFO - "product": "firefox", 01:00:26 INFO - "script_repo_revision": "production", 01:00:26 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 01:00:26 INFO - "repository": "", 01:00:26 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 01:00:26 INFO - "buildid": "20160113203226", 01:00:26 INFO - "pgo_build": "True", 01:00:26 INFO - "basedir": "/builds/slave/test-pgo", 01:00:26 INFO - "buildnumber": 445, 01:00:26 INFO - "slavename": "talos-linux64-ix-010", 01:00:26 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 01:00:26 INFO - "platform": "ubuntu64_hw", 01:00:26 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 01:00:26 INFO - "branch": "fx-team", 01:00:26 INFO - "repo_path": "integration/fx-team", 01:00:26 INFO - "revision": "bc0334f3ea8d97905464ec64c95d8d2787e3fa3c", 01:00:26 INFO - "stage_platform": "linux64-pgo", 01:00:26 INFO - "builduid": "29f441d276314179ad302e0b54b38d93", 01:00:26 INFO - "slavebuilddir": "test" 01:00:26 INFO - } 01:00:26 INFO - Found installer url https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 01:00:26 INFO - Running post-action listener: _resource_record_post_action 01:00:26 INFO - ##### 01:00:26 INFO - ##### Running download-and-extract step. 01:00:26 INFO - ##### 01:00:26 INFO - Running pre-action listener: _resource_record_pre_action 01:00:26 INFO - Running main action method: download_and_extract 01:00:26 INFO - mkdir: /builds/slave/test-pgo/build/tests 01:00:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:26 INFO - https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 01:00:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/test_packages.json 01:00:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/test_packages.json 01:00:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 01:00:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 01:00:27 INFO - Downloaded 1448 bytes. 01:00:27 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 01:00:27 INFO - Using the following test package requirements: 01:00:27 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 01:00:27 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 01:00:27 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 01:00:27 INFO - u'gtest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 01:00:27 INFO - u'firefox-46.0a1.en-US.linux-x86_64.gtest.tests.zip'], 01:00:27 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 01:00:27 INFO - u'jsshell-linux-x86_64.zip'], 01:00:27 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 01:00:27 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 01:00:27 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 01:00:27 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 01:00:27 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 01:00:27 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 01:00:27 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 01:00:27 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 01:00:27 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 01:00:27 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 01:00:27 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 01:00:27 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 01:00:27 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 01:00:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:27 INFO - https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 01:00:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 01:00:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 01:00:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 01:00:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 01:00:31 INFO - Downloaded 24030981 bytes. 01:00:31 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 01:00:31 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 01:00:31 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 01:00:32 INFO - Return code: 0 01:00:32 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 01:00:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:32 INFO - https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 01:00:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 01:00:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 01:00:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 01:00:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 01:00:37 INFO - Downloaded 24030981 bytes. 01:00:37 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 01:00:37 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 01:00:37 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 01:00:38 INFO - Return code: 0 01:00:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:38 INFO - https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 01:00:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 01:00:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 01:00:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 01:00:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 01:00:40 INFO - Downloaded 11132144 bytes. 01:00:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test-pgo/build/tests 01:00:40 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 01:00:40 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 01:00:40 INFO - Return code: 0 01:00:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:40 INFO - https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 01:00:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 01:00:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 01:00:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 01:00:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 01:00:46 INFO - Downloaded 55870921 bytes. 01:00:46 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 01:00:46 INFO - mkdir: /builds/slave/test-pgo/properties 01:00:46 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 01:00:46 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 01:00:46 INFO - Contents: 01:00:46 INFO - build_url:https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 01:00:46 INFO - Running post-action listener: _resource_record_post_action 01:00:46 INFO - Running post-action listener: set_extra_try_arguments 01:00:46 INFO - ##### 01:00:46 INFO - ##### Running populate-webroot step. 01:00:46 INFO - ##### 01:00:46 INFO - Running pre-action listener: _resource_record_pre_action 01:00:46 INFO - Running main action method: populate_webroot 01:00:46 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 01:00:46 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 01:00:46 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 01:00:46 INFO - '--tppagecycles', 01:00:46 INFO - '7'], 01:00:46 INFO - 'tests': ['tsvgm']}}, 01:00:46 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 01:00:46 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 01:00:46 INFO - 'tests': ['tresize', 'tcanvasmark']}, 01:00:46 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 01:00:46 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 01:00:46 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 01:00:46 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:00:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:00:46 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:00:46 INFO - 'talos_options': ['--e10s'], 01:00:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 01:00:46 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:00:46 INFO - 'tests': ['damp', 'tps']}, 01:00:46 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:00:46 INFO - 'talos_options': ['--e10s'], 01:00:46 INFO - 'tests': ['damp', 'tps']}, 01:00:46 INFO - 'g3': {'tests': ['dromaeo_dom']}, 01:00:46 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 01:00:46 INFO - 'other': {'tests': ['a11yr', 01:00:46 INFO - 'ts_paint', 01:00:46 INFO - 'tpaint', 01:00:46 INFO - 'sessionrestore', 01:00:46 INFO - 'sessionrestore_no_auto_restore']}, 01:00:46 INFO - 'other-e10s': {'talos_options': ['--e10s'], 01:00:46 INFO - 'tests': ['a11yr', 01:00:46 INFO - 'ts_paint', 01:00:46 INFO - 'tpaint', 01:00:46 INFO - 'sessionrestore', 01:00:46 INFO - 'sessionrestore_no_auto_restore']}, 01:00:46 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 01:00:46 INFO - 'tests': ['a11yr', 01:00:46 INFO - 'ts_paint', 01:00:46 INFO - 'tpaint', 01:00:46 INFO - 'sessionrestore', 01:00:46 INFO - 'sessionrestore_no_auto_restore']}, 01:00:46 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 01:00:46 INFO - 'tests': ['a11yr', 01:00:46 INFO - 'ts_paint', 01:00:46 INFO - 'tpaint', 01:00:46 INFO - 'sessionrestore', 01:00:46 INFO - 'sessionrestore_no_auto_restore']}, 01:00:46 INFO - 'other_l64': {'tests': ['a11yr', 01:00:46 INFO - 'ts_paint', 01:00:46 INFO - 'tpaint', 01:00:46 INFO - 'sessionrestore', 01:00:46 INFO - 'sessionrestore_no_auto_restore']}, 01:00:46 INFO - 'other_nol64': {'tests': ['a11yr', 01:00:46 INFO - 'ts_paint', 01:00:46 INFO - 'tpaint', 01:00:46 INFO - 'sessionrestore', 01:00:46 INFO - 'sessionrestore_no_auto_restore']}, 01:00:46 INFO - 'svgr': {'tests': ['tsvgx', 01:00:46 INFO - 'tsvgr_opacity', 01:00:46 INFO - 'tart', 01:00:46 INFO - 'tscrollx', 01:00:46 INFO - 'cart']}, 01:00:46 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 01:00:46 INFO - 'tests': ['tsvgx', 01:00:46 INFO - 'tsvgr_opacity', 01:00:46 INFO - 'tart', 01:00:46 INFO - 'tscrollx', 01:00:46 INFO - 'cart']}, 01:00:46 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:00:46 INFO - 'tests': ['tp5o']}, 01:00:46 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:00:46 INFO - 'talos_options': ['--e10s'], 01:00:46 INFO - 'tests': ['tp5o']}, 01:00:46 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:00:46 INFO - 'talos_options': ['--xperf_path', 01:00:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:00:46 INFO - 'tests': ['tp5n']}, 01:00:46 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 01:00:46 INFO - 'talos_options': ['--e10s', 01:00:46 INFO - '--xperf_path', 01:00:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 01:00:46 INFO - 'tests': ['tp5n']}}, 01:00:46 INFO - 'talos.zip': {'path': '', 01:00:46 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 01:00:46 INFO - Running post-action listener: _resource_record_post_action 01:00:46 INFO - ##### 01:00:46 INFO - ##### Running create-virtualenv step. 01:00:46 INFO - ##### 01:00:46 INFO - Running pre-action listener: _resource_record_pre_action 01:00:46 INFO - Running main action method: create_virtualenv 01:00:46 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 01:00:46 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 01:00:46 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 01:00:47 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 01:00:47 INFO - Using real prefix '/usr' 01:00:47 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 01:00:47 INFO - Installing distribute.............................................................................................................................................................................................done. 01:00:49 INFO - Installing pip.................done. 01:00:49 INFO - Return code: 0 01:00:49 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 01:00:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:00:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:00:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:00:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:00:49 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7fb4f30ecf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xea98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf79630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a840>, '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 0xf776b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf77b60>, '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': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:00:49 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 01:00:49 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 01:00:49 INFO - Using env: {'DISPLAY': ':0', 01:00:49 INFO - 'HOME': '/home/cltbld', 01:00:49 INFO - 'LANG': 'en_US.UTF-8', 01:00:49 INFO - 'LANGUAGE': 'en_US:en', 01:00:49 INFO - 'LOGNAME': 'cltbld', 01:00:49 INFO - 'MAIL': '/var/mail/cltbld', 01:00:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:00:49 INFO - 'MOZ_NO_REMOTE': '1', 01:00:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:00:49 INFO - 'NO_EM_RESTART': '1', 01:00:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:00:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:00:49 INFO - 'PWD': '/builds/slave/test-pgo', 01:00:49 INFO - 'SHELL': '/bin/bash', 01:00:49 INFO - 'SHLVL': '1', 01:00:49 INFO - 'TERM': 'linux', 01:00:49 INFO - 'TMOUT': '86400', 01:00:49 INFO - 'USER': 'cltbld', 01:00:49 INFO - 'XDG_SESSION_COOKIE': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 01:00:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:00:49 INFO - '_': '/tools/buildbot/bin/python'} 01:00:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:00:49 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 01:00:49 INFO - Cleaning up... 01:00:49 INFO - Return code: 0 01:00:49 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 01:00:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:00:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:00:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:00:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:00:49 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7fb4f30ecf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xea98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf79630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a840>, '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 0xf776b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf77b60>, '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': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:00:49 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 01:00:49 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 01:00:49 INFO - Using env: {'DISPLAY': ':0', 01:00:49 INFO - 'HOME': '/home/cltbld', 01:00:49 INFO - 'LANG': 'en_US.UTF-8', 01:00:49 INFO - 'LANGUAGE': 'en_US:en', 01:00:49 INFO - 'LOGNAME': 'cltbld', 01:00:49 INFO - 'MAIL': '/var/mail/cltbld', 01:00:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:00:49 INFO - 'MOZ_NO_REMOTE': '1', 01:00:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:00:49 INFO - 'NO_EM_RESTART': '1', 01:00:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:00:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:00:49 INFO - 'PWD': '/builds/slave/test-pgo', 01:00:49 INFO - 'SHELL': '/bin/bash', 01:00:49 INFO - 'SHLVL': '1', 01:00:49 INFO - 'TERM': 'linux', 01:00:49 INFO - 'TMOUT': '86400', 01:00:49 INFO - 'USER': 'cltbld', 01:00:49 INFO - 'XDG_SESSION_COOKIE': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 01:00:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:00:49 INFO - '_': '/tools/buildbot/bin/python'} 01:00:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:00:49 INFO - Downloading/unpacking psutil>=0.7.1 01:00:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:00:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:00:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:00:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:00:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:00:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:00:51 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 01:00:51 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 01:00:51 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 01:00:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:00:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:00:51 INFO - Installing collected packages: psutil 01:00:51 INFO - Running setup.py install for psutil 01:00:51 INFO - building 'psutil._psutil_linux' extension 01:00:51 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 01:00:51 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 01:00:51 INFO - building 'psutil._psutil_posix' extension 01:00:51 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 01:00:52 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 01:00:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 01:00:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 01:00:52 INFO - Successfully installed psutil 01:00:52 INFO - Cleaning up... 01:00:52 INFO - Return code: 0 01:00:52 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 01:00:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:00:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:00:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:00:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:00:52 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7fb4f30ecf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xea98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf79630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a840>, '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 0xf776b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf77b60>, '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': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:00:52 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 01:00:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 01:00:52 INFO - Using env: {'DISPLAY': ':0', 01:00:52 INFO - 'HOME': '/home/cltbld', 01:00:52 INFO - 'LANG': 'en_US.UTF-8', 01:00:52 INFO - 'LANGUAGE': 'en_US:en', 01:00:52 INFO - 'LOGNAME': 'cltbld', 01:00:52 INFO - 'MAIL': '/var/mail/cltbld', 01:00:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:00:52 INFO - 'MOZ_NO_REMOTE': '1', 01:00:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:00:52 INFO - 'NO_EM_RESTART': '1', 01:00:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:00:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:00:52 INFO - 'PWD': '/builds/slave/test-pgo', 01:00:52 INFO - 'SHELL': '/bin/bash', 01:00:52 INFO - 'SHLVL': '1', 01:00:52 INFO - 'TERM': 'linux', 01:00:52 INFO - 'TMOUT': '86400', 01:00:52 INFO - 'USER': 'cltbld', 01:00:52 INFO - 'XDG_SESSION_COOKIE': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 01:00:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:00:52 INFO - '_': '/tools/buildbot/bin/python'} 01:00:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:00:52 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 01:00:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:00:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:00:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:00:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:00:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:00:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:00:54 INFO - Downloading mozsystemmonitor-0.0.tar.gz 01:00:54 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 01:00:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 01:00:54 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 01:00:54 INFO - Installing collected packages: mozsystemmonitor 01:00:54 INFO - Running setup.py install for mozsystemmonitor 01:00:54 INFO - Successfully installed mozsystemmonitor 01:00:54 INFO - Cleaning up... 01:00:54 INFO - Return code: 0 01:00:54 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 01:00:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:00:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:00:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:00:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:00:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:00:54 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7fb4f30ecf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xea98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf79630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a840>, '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 0xf776b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf77b60>, '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': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:00:54 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 01:00:54 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 01:00:54 INFO - Using env: {'DISPLAY': ':0', 01:00:54 INFO - 'HOME': '/home/cltbld', 01:00:54 INFO - 'LANG': 'en_US.UTF-8', 01:00:54 INFO - 'LANGUAGE': 'en_US:en', 01:00:54 INFO - 'LOGNAME': 'cltbld', 01:00:54 INFO - 'MAIL': '/var/mail/cltbld', 01:00:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:00:54 INFO - 'MOZ_NO_REMOTE': '1', 01:00:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:00:54 INFO - 'NO_EM_RESTART': '1', 01:00:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:00:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:00:54 INFO - 'PWD': '/builds/slave/test-pgo', 01:00:54 INFO - 'SHELL': '/bin/bash', 01:00:54 INFO - 'SHLVL': '1', 01:00:54 INFO - 'TERM': 'linux', 01:00:54 INFO - 'TMOUT': '86400', 01:00:54 INFO - 'USER': 'cltbld', 01:00:54 INFO - 'XDG_SESSION_COOKIE': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 01:00:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:00:54 INFO - '_': '/tools/buildbot/bin/python'} 01:00:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:00:54 INFO - Downloading/unpacking blobuploader==1.2.4 01:00:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:00:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:00:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:00:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:00:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:00:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:00:56 INFO - Downloading blobuploader-1.2.4.tar.gz 01:00:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 01:00:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 01:00:56 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 01:00:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:00:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:00:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:00:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:00:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:00:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:00:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 01:00:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 01:00:56 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 01:00:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:00:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:00:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:00:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:00:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:00:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:00:56 INFO - Downloading docopt-0.6.1.tar.gz 01:00:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 01:00:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 01:00:57 INFO - Installing collected packages: blobuploader, requests, docopt 01:00:57 INFO - Running setup.py install for blobuploader 01:00:57 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 01:00:57 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 01:00:57 INFO - Running setup.py install for requests 01:00:57 INFO - Running setup.py install for docopt 01:00:57 INFO - Successfully installed blobuploader requests docopt 01:00:57 INFO - Cleaning up... 01:00:57 INFO - Return code: 0 01:00:57 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 01:00: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')]} 01:00:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:00:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:00: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')]} 01:00:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:00:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:00:57 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7fb4f30ecf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xea98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf79630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a840>, '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 0xf776b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf77b60>, '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': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:00:57 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 01:00:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 01:00:57 INFO - Using env: {'DISPLAY': ':0', 01:00:57 INFO - 'HOME': '/home/cltbld', 01:00:57 INFO - 'LANG': 'en_US.UTF-8', 01:00:57 INFO - 'LANGUAGE': 'en_US:en', 01:00:57 INFO - 'LOGNAME': 'cltbld', 01:00:57 INFO - 'MAIL': '/var/mail/cltbld', 01:00:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:00:57 INFO - 'MOZ_NO_REMOTE': '1', 01:00:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:00:57 INFO - 'NO_EM_RESTART': '1', 01:00:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:00:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:00:57 INFO - 'PWD': '/builds/slave/test-pgo', 01:00:57 INFO - 'SHELL': '/bin/bash', 01:00:57 INFO - 'SHLVL': '1', 01:00:57 INFO - 'TERM': 'linux', 01:00:57 INFO - 'TMOUT': '86400', 01:00:57 INFO - 'USER': 'cltbld', 01:00:57 INFO - 'XDG_SESSION_COOKIE': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 01:00:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:00:57 INFO - '_': '/tools/buildbot/bin/python'} 01:00:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:00:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:00:57 INFO - Running setup.py (path:/tmp/pip-Wu9xON-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:00:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:00:57 INFO - Running setup.py (path:/tmp/pip-uVs8AY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:00:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:00:57 INFO - Running setup.py (path:/tmp/pip-THzm3g-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:00:58 INFO - Running setup.py (path:/tmp/pip-MktoRb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 01:00:58 INFO - Running setup.py (path:/tmp/pip-qN7Ms9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:00:58 INFO - Running setup.py (path:/tmp/pip-mSqWOj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:00:58 INFO - Running setup.py (path:/tmp/pip-XjDFJv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:00:58 INFO - Running setup.py (path:/tmp/pip-NWSlIV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 01:00:58 INFO - Running setup.py (path:/tmp/pip-p3rLEy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 01:00:58 INFO - Running setup.py (path:/tmp/pip-XXZvQU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:00:58 INFO - Running setup.py (path:/tmp/pip-4MBxpa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:00:58 INFO - Running setup.py (path:/tmp/pip-r1h_jT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:00:58 INFO - Running setup.py (path:/tmp/pip-1xO1a0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:00:58 INFO - Running setup.py (path:/tmp/pip-V8as_D-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:00:58 INFO - Running setup.py (path:/tmp/pip-Ulxley-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:00:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 01:00:58 INFO - Running setup.py (path:/tmp/pip-hsleU0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 01:00:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 01:00:59 INFO - Running setup.py (path:/tmp/pip-goi2h1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 01:00:59 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 01:00:59 INFO - Running setup.py install for manifestparser 01:00:59 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 01:00:59 INFO - Running setup.py install for mozcrash 01:00:59 INFO - Running setup.py install for mozdebug 01:00:59 INFO - Running setup.py install for mozdevice 01:00:59 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 01:00:59 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 01:00:59 INFO - Running setup.py install for mozfile 01:00:59 INFO - Running setup.py install for mozhttpd 01:00:59 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 01:00:59 INFO - Running setup.py install for mozinfo 01:00:59 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 01:00:59 INFO - Running setup.py install for mozInstall 01:00:59 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 01:00:59 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 01:00:59 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 01:00:59 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 01:00:59 INFO - Running setup.py install for mozleak 01:00:59 INFO - Running setup.py install for mozlog 01:01:00 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 01:01:00 INFO - Running setup.py install for moznetwork 01:01:00 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 01:01:00 INFO - Running setup.py install for mozprocess 01:01:00 INFO - Running setup.py install for mozprofile 01:01:00 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 01:01:00 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 01:01:00 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 01:01:00 INFO - Running setup.py install for mozrunner 01:01:00 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 01:01:00 INFO - Running setup.py install for mozscreenshot 01:01:00 INFO - Running setup.py install for moztest 01:01:00 INFO - Running setup.py install for mozversion 01:01:00 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 01:01:00 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 01:01:00 INFO - Cleaning up... 01:01:00 INFO - Return code: 0 01:01:00 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 01:01:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:01:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:01:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:01:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:01:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:01:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:01:00 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7fb4f30ecf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xea98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf79630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a840>, '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 0xf776b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf77b60>, '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': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:01:00 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 01:01:00 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 01:01:00 INFO - Using env: {'DISPLAY': ':0', 01:01:00 INFO - 'HOME': '/home/cltbld', 01:01:00 INFO - 'LANG': 'en_US.UTF-8', 01:01:00 INFO - 'LANGUAGE': 'en_US:en', 01:01:00 INFO - 'LOGNAME': 'cltbld', 01:01:00 INFO - 'MAIL': '/var/mail/cltbld', 01:01:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:01:00 INFO - 'MOZ_NO_REMOTE': '1', 01:01:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:01:00 INFO - 'NO_EM_RESTART': '1', 01:01:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:01:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:01:00 INFO - 'PWD': '/builds/slave/test-pgo', 01:01:00 INFO - 'SHELL': '/bin/bash', 01:01:00 INFO - 'SHLVL': '1', 01:01:00 INFO - 'TERM': 'linux', 01:01:00 INFO - 'TMOUT': '86400', 01:01:00 INFO - 'USER': 'cltbld', 01:01:00 INFO - 'XDG_SESSION_COOKIE': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 01:01:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:01:00 INFO - '_': '/tools/buildbot/bin/python'} 01:01:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:01:01 INFO - Running setup.py (path:/tmp/pip-wlMPO3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 01:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:01:01 INFO - Running setup.py (path:/tmp/pip-RUSZfR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 01:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:01:01 INFO - Running setup.py (path:/tmp/pip-lctScS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 01:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:01:01 INFO - Running setup.py (path:/tmp/pip-gb3ctw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 01:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 01:01:01 INFO - Running setup.py (path:/tmp/pip-AfTGtV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 01:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5)) 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:01:01 INFO - Running setup.py (path:/tmp/pip-kLErVQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 01:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6)) 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:01:01 INFO - Running setup.py (path:/tmp/pip-jsHqJK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 01:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7)) 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:01:01 INFO - Running setup.py (path:/tmp/pip-SuXX7d-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 01:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8)) 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 01:01:01 INFO - Running setup.py (path:/tmp/pip-Za6Sq_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 01:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 01:01:01 INFO - Running setup.py (path:/tmp/pip-_Km18d-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 01:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:01:01 INFO - Running setup.py (path:/tmp/pip-MuRQcw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 01:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:01:01 INFO - Running setup.py (path:/tmp/pip-MTgx6F-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 01:01:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 01:01:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:01:01 INFO - Running setup.py (path:/tmp/pip-PjEx43-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 01:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13)) 01:01:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:01:02 INFO - Running setup.py (path:/tmp/pip-1GXMmR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 01:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 01:01:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:01:02 INFO - Running setup.py (path:/tmp/pip-AAv3P0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 01:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 01:01:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 01:01:02 INFO - Running setup.py (path:/tmp/pip-QgkQ6c-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 01:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16)) 01:01:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 01:01:02 INFO - Running setup.py (path:/tmp/pip-cSg43J-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 01:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 01:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 01:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 01:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 01:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 01:01:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 01:01:02 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 01:01:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:01:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:01:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:01:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:01:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:01:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:01:04 INFO - Downloading blessings-1.5.1.tar.gz 01:01:04 INFO - Storing download in cache at /builds/slave/test-pgo/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 01:01:04 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 01:01:04 INFO - Installing collected packages: blessings 01:01:04 INFO - Running setup.py install for blessings 01:01:04 INFO - Successfully installed blessings 01:01:04 INFO - Cleaning up... 01:01:04 INFO - Return code: 0 01:01:04 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 01:01:04 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 01:01:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 01:01:04 INFO - Reading from file tmpfile_stdout 01:01:04 INFO - Current package versions: 01:01:04 INFO - argparse == 1.2.1 01:01:04 INFO - blessings == 1.5.1 01:01:04 INFO - blobuploader == 1.2.4 01:01:04 INFO - docopt == 0.6.1 01:01:04 INFO - manifestparser == 1.1 01:01:04 INFO - mozInstall == 1.12 01:01:04 INFO - mozcrash == 0.16 01:01:04 INFO - mozdebug == 0.1 01:01:04 INFO - mozdevice == 0.48 01:01:04 INFO - mozfile == 1.2 01:01:04 INFO - mozhttpd == 0.7 01:01:04 INFO - mozinfo == 0.9 01:01:04 INFO - mozleak == 0.1 01:01:04 INFO - mozlog == 3.1 01:01:04 INFO - moznetwork == 0.27 01:01:04 INFO - mozprocess == 0.22 01:01:04 INFO - mozprofile == 0.28 01:01:04 INFO - mozrunner == 6.11 01:01:04 INFO - mozscreenshot == 0.1 01:01:04 INFO - mozsystemmonitor == 0.0 01:01:04 INFO - moztest == 0.7 01:01:04 INFO - mozversion == 1.4 01:01:04 INFO - psutil == 3.1.1 01:01:04 INFO - requests == 1.2.3 01:01:04 INFO - wsgiref == 0.1.2 01:01:04 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 01:01:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:01:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:01:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:01:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:01:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:01:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:01:04 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7fb4f30ecf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xea98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf79630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a840>, '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 0xf776b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf77b60>, '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': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:01:04 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/talos 01:01:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 01:01:04 INFO - Using env: {'DISPLAY': ':0', 01:01:04 INFO - 'HOME': '/home/cltbld', 01:01:04 INFO - 'LANG': 'en_US.UTF-8', 01:01:04 INFO - 'LANGUAGE': 'en_US:en', 01:01:04 INFO - 'LOGNAME': 'cltbld', 01:01:04 INFO - 'MAIL': '/var/mail/cltbld', 01:01:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:01:04 INFO - 'MOZ_NO_REMOTE': '1', 01:01:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:01:04 INFO - 'NO_EM_RESTART': '1', 01:01:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:01:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:01:04 INFO - 'PWD': '/builds/slave/test-pgo', 01:01:04 INFO - 'SHELL': '/bin/bash', 01:01:04 INFO - 'SHLVL': '1', 01:01:04 INFO - 'TERM': 'linux', 01:01:04 INFO - 'TMOUT': '86400', 01:01:04 INFO - 'USER': 'cltbld', 01:01:04 INFO - 'XDG_SESSION_COOKIE': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 01:01:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:01:04 INFO - '_': '/tools/buildbot/bin/python'} 01:01:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:01:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 01:01:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2)) 01:01:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 01:01:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 01:01:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5)) 01:01:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6)) 01:01:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7)) 01:01:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8)) 01:01:04 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 9)) 01:01:04 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 01:01:04 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 01:01:04 INFO - Cleaning up... 01:01:04 INFO - Return code: 0 01:01:04 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 01:01:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:01:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:01:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:01:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:01:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:01:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:01:04 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7fb4f30ecf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xea98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf79630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a840>, '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 0xf776b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf77b60>, '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': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:01:04 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test-pgo/build 01:01:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 01:01:04 INFO - Using env: {'DISPLAY': ':0', 01:01:04 INFO - 'HOME': '/home/cltbld', 01:01:04 INFO - 'LANG': 'en_US.UTF-8', 01:01:04 INFO - 'LANGUAGE': 'en_US:en', 01:01:04 INFO - 'LOGNAME': 'cltbld', 01:01:04 INFO - 'MAIL': '/var/mail/cltbld', 01:01:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:01:04 INFO - 'MOZ_NO_REMOTE': '1', 01:01:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:01:04 INFO - 'NO_EM_RESTART': '1', 01:01:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:01:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:01:04 INFO - 'PWD': '/builds/slave/test-pgo', 01:01:04 INFO - 'SHELL': '/bin/bash', 01:01:04 INFO - 'SHLVL': '1', 01:01:04 INFO - 'TERM': 'linux', 01:01:04 INFO - 'TMOUT': '86400', 01:01:04 INFO - 'USER': 'cltbld', 01:01:04 INFO - 'XDG_SESSION_COOKIE': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 01:01:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:01:04 INFO - '_': '/tools/buildbot/bin/python'} 01:01:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:01:04 INFO - Downloading/unpacking jsonschema 01:01:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:01:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:01:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:01:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:01:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:01:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:01:06 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 01:01:06 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fjsonschema-2.5.1-py2.py3-none-any.whl 01:01:06 INFO - Downloading/unpacking functools32 (from jsonschema) 01:01: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 01:01: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 01:01: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 01:01: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 01:01: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 01:01: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 01:01:06 INFO - Downloading functools32-3.2.3-2.tar.gz 01:01:06 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 01:01:06 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 01:01:06 INFO - warning: no files found matching '*.txt' 01:01:06 INFO - no previously-included directories found matching 'build' 01:01:06 INFO - no previously-included directories found matching 'dist' 01:01:06 INFO - no previously-included directories found matching '.git*' 01:01:06 INFO - Installing collected packages: jsonschema, functools32 01:01:06 INFO - Running setup.py install for functools32 01:01:07 INFO - warning: no files found matching '*.txt' 01:01:07 INFO - no previously-included directories found matching 'build' 01:01:07 INFO - no previously-included directories found matching 'dist' 01:01:07 INFO - no previously-included directories found matching '.git*' 01:01:07 INFO - Successfully installed jsonschema functools32 01:01:07 INFO - Cleaning up... 01:01:07 INFO - Return code: 0 01:01:07 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 01:01:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:01:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 01:01:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:01:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:01:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 01:01:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 01:01:07 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--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 0x7fb4f30ecf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xea98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xf79630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100a840>, '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 0xf776b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf77b60>, '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': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 01:01:07 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test-pgo/build 01:01:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 01:01:07 INFO - Using env: {'DISPLAY': ':0', 01:01:07 INFO - 'HOME': '/home/cltbld', 01:01:07 INFO - 'LANG': 'en_US.UTF-8', 01:01:07 INFO - 'LANGUAGE': 'en_US:en', 01:01:07 INFO - 'LOGNAME': 'cltbld', 01:01:07 INFO - 'MAIL': '/var/mail/cltbld', 01:01:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:01:07 INFO - 'MOZ_NO_REMOTE': '1', 01:01:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:01:07 INFO - 'NO_EM_RESTART': '1', 01:01:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:01:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:01:07 INFO - 'PWD': '/builds/slave/test-pgo', 01:01:07 INFO - 'SHELL': '/bin/bash', 01:01:07 INFO - 'SHLVL': '1', 01:01:07 INFO - 'TERM': 'linux', 01:01:07 INFO - 'TMOUT': '86400', 01:01:07 INFO - 'USER': 'cltbld', 01:01:07 INFO - 'XDG_SESSION_COOKIE': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 01:01:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:01:07 INFO - '_': '/tools/buildbot/bin/python'} 01:01:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 01:01:07 INFO - Downloading/unpacking flake8 01:01:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:01:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:01:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:01:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:01:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:01:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:01:08 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 01:01:08 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fflake8-2.5.0-py2.py3-none-any.whl 01:01:08 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 01:01:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:01:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:01:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:01:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 01:01:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 01:01:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 01:01:09 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 01:01:09 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmccabe-0.3.1-py2.py3-none-any.whl 01:01:09 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 01:01: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 01:01: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 01:01: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 01:01: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 01:01: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 01:01: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 01:01:09 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpyflakes-1.0.0-py2.py3-none-any.whl 01:01:09 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 01:01: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 01:01: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 01:01: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 01:01: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 01:01: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 01:01: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 01:01:09 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 01:01:09 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 01:01:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 01:01:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 01:01:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 01:01:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 01:01:09 INFO - no previously-included directories found matching 'docs/_build' 01:01:09 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 01:01:09 INFO - Running setup.py install for pep8 01:01:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 01:01:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 01:01:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 01:01:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 01:01:09 INFO - no previously-included directories found matching 'docs/_build' 01:01:09 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 01:01:09 INFO - Successfully installed flake8 mccabe pyflakes pep8 01:01:09 INFO - Cleaning up... 01:01:09 INFO - Return code: 0 01:01:09 INFO - Running post-action listener: _resource_record_post_action 01:01:09 INFO - Running post-action listener: _start_resource_monitoring 01:01:09 INFO - Starting resource monitoring. 01:01:09 INFO - ##### 01:01:09 INFO - ##### Running install step. 01:01:09 INFO - ##### 01:01:09 INFO - Running pre-action listener: _resource_record_pre_action 01:01:09 INFO - Running main action method: install 01:01:09 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 01:01:09 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 01:01:10 INFO - Reading from file tmpfile_stdout 01:01:10 INFO - Detecting whether we're running mozinstall >=1.0... 01:01:10 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 01:01:10 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 01:01:10 INFO - Reading from file tmpfile_stdout 01:01:10 INFO - Output received: 01:01:10 INFO - Usage: mozinstall [options] installer 01:01:10 INFO - Options: 01:01:10 INFO - -h, --help show this help message and exit 01:01:10 INFO - -d DEST, --destination=DEST 01:01:10 INFO - Directory to install application into. [default: 01:01:10 INFO - "/builds/slave/test-pgo"] 01:01:10 INFO - --app=APP Application being installed. [default: firefox] 01:01:10 INFO - mkdir: /builds/slave/test-pgo/build/application 01:01:10 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 01:01:10 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 01:01:26 INFO - Reading from file tmpfile_stdout 01:01:26 INFO - Output received: 01:01:26 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 01:01:26 INFO - Running post-action listener: _resource_record_post_action 01:01:26 INFO - ##### 01:01:26 INFO - ##### Running run-tests step. 01:01:26 INFO - ##### 01:01:26 INFO - Running pre-action listener: _resource_record_pre_action 01:01:26 INFO - Running main action method: run_tests 01:01:26 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 01:01:26 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 01:01:26 INFO - Python 2.7.3 01:01:26 INFO - Return code: 0 01:01:26 INFO - grabbing minidump binary from tooltool 01:01:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 01:01:26 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 0x100a840>, '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 0xf776b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf77b60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 01:01:26 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 01:01:26 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 01:01:26 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 01:01:26 INFO - Return code: 0 01:01:26 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 01:01:26 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 01:01:26 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 01:01:26 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 01:01:26 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 01:01:26 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 01:01:26 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 01:01:27 INFO - Return code: 0 01:01:27 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-010', '--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 01:01:27 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-010 --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 01:01:27 INFO - Using env: {'DISPLAY': ':0', 01:01:27 INFO - 'HOME': '/home/cltbld', 01:01:27 INFO - 'LANG': 'en_US.UTF-8', 01:01:27 INFO - 'LANGUAGE': 'en_US:en', 01:01:27 INFO - 'LOGNAME': 'cltbld', 01:01:27 INFO - 'MAIL': '/var/mail/cltbld', 01:01:27 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 01:01:27 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 01:01:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 01:01:27 INFO - 'MOZ_NO_REMOTE': '1', 01:01:27 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 01:01:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 01:01:27 INFO - 'NO_EM_RESTART': '1', 01:01:27 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 01:01:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 01:01:27 INFO - 'PWD': '/builds/slave/test-pgo', 01:01:27 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 01:01:27 INFO - 'SHELL': '/bin/bash', 01:01:27 INFO - 'SHLVL': '1', 01:01:27 INFO - 'TERM': 'linux', 01:01:27 INFO - 'TMOUT': '86400', 01:01:27 INFO - 'USER': 'cltbld', 01:01:27 INFO - 'XDG_SESSION_COOKIE': 'eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476', 01:01:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 01:01:27 INFO - '_': '/tools/buildbot/bin/python'} 01:01:27 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-010', '--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 01:01:27 INFO - mozversion application_buildid: 20160113203226 01:01:27 INFO - mozversion application_changeset: bc0334f3ea8d97905464ec64c95d8d2787e3fa3c 01:01:27 INFO - mozversion application_display_name: Nightly 01:01:27 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 01:01:27 INFO - mozversion application_name: Firefox 01:01:27 INFO - mozversion application_remotingname: firefox 01:01:27 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 01:01:27 INFO - mozversion application_vendor: Mozilla 01:01:27 INFO - mozversion application_version: 46.0a1 01:01:27 INFO - mozversion platform_buildid: 20160113203226 01:01:27 INFO - mozversion platform_changeset: bc0334f3ea8d97905464ec64c95d8d2787e3fa3c 01:01:27 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 01:01:27 INFO - mozversion platform_version: 46.0a1 01:01:27 INFO - using testdate: 1452762087 01:01:27 INFO - actual date: 1452762087 01:01:27 INFO - starting webserver on 'localhost:57274' 01:01:27 INFO - SUITE-START | Running 3 tests 01:01:27 INFO - TEST-START | dromaeo_css 01:01:27 INFO - operating with platform_type : linux_ 01:01:27 INFO - Initialising browser for dromaeo_css test... 01:01:27 INFO - TEST-INFO | started process 14892 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpOKa5dy/profile http://localhost:57274/getInfo.html) 01:01:31 INFO - PROCESS | 14892 | 01:01:31 INFO - PROCESS | 14892 | (process:14976): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 01:01:32 INFO - PROCESS | 14892 | __metrics Screen width/height:1600/1200 01:01:32 INFO - PROCESS | 14892 | colorDepth:24 01:01:32 INFO - PROCESS | 14892 | Browser inner width/height: 1024/697 01:01:32 INFO - PROCESS | 14892 | __metrics 01:01:32 INFO - PROCESS | 14892 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 01:01:32 INFO - PROCESS | 14892 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 01:01:33 INFO - TEST-INFO | 14892: exit 0 01:01:33 INFO - Browser initialized. 01:01:33 INFO - Running cycle 1/1 for dromaeo_css test... 01:01:33 INFO - TEST-INFO | started process 15026 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpOKa5dy/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 01:01:34 INFO - PROCESS | 15026 | 01:01:34 INFO - PROCESS | 15026 | (process:15086): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 01:01:45 INFO - PROCESS | 15026 | RSS: Main: 150806528 01:01:45 INFO - PROCESS | 15026 | 01:02:34 INFO - PROCESS | 15026 | 1452762154681 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 01:04:43 INFO - PROCESS | 15026 | Cycle 1(1): loaded http://localhost:57274/tests/dromaeo/cssquery-dojo.html (next: http://localhost:57274/tests/dromaeo/cssquery-ext.html) 01:04:44 INFO - PROCESS | 15026 | RSS: Main: 155246592 01:04:44 INFO - PROCESS | 15026 | 01:07:46 INFO - PROCESS | 15026 | Cycle 1(1): loaded http://localhost:57274/tests/dromaeo/cssquery-ext.html (next: http://localhost:57274/tests/dromaeo/cssquery-jquery.html) 01:07:47 INFO - PROCESS | 15026 | RSS: Main: 152535040 01:07:47 INFO - PROCESS | 15026 | 01:10:49 INFO - PROCESS | 15026 | Cycle 1(1): loaded http://localhost:57274/tests/dromaeo/cssquery-jquery.html (next: http://localhost:57274/tests/dromaeo/cssquery-mootools.html) 01:10:49 INFO - PROCESS | 15026 | RSS: Main: 153071616 01:10:49 INFO - PROCESS | 15026 | 01:13:51 INFO - PROCESS | 15026 | Cycle 1(1): loaded http://localhost:57274/tests/dromaeo/cssquery-mootools.html (next: http://localhost:57274/tests/dromaeo/cssquery-prototype.html) 01:13:52 INFO - PROCESS | 15026 | RSS: Main: 150794240 01:13:52 INFO - PROCESS | 15026 | 01:16:54 INFO - PROCESS | 15026 | Cycle 1(1): loaded http://localhost:57274/tests/dromaeo/cssquery-prototype.html (next: http://localhost:57274/tests/dromaeo/cssquery-yui.html) 01:16:55 INFO - PROCESS | 15026 | RSS: Main: 150560768 01:16:55 INFO - PROCESS | 15026 | 01:19:57 INFO - PROCESS | 15026 | Cycle 1(1): loaded http://localhost:57274/tests/dromaeo/cssquery-yui.html (next: http://localhost:57274/tests/dromaeo/cssquery-dojo.html) 01:19:57 INFO - PROCESS | 15026 | RSS: Main: 152915968 01:19:57 INFO - PROCESS | 15026 | 01:19:57 INFO - PROCESS | 15026 | __start_tp_report 01:19:57 INFO - PROCESS | 15026 | _x_x_mozilla_page_load 01:19:57 INFO - PROCESS | 15026 | _x_x_mozilla_page_load_details 01:19:57 INFO - PROCESS | 15026 | |i|pagename|runs| 01:19:57 INFO - PROCESS | 15026 | |0;dojo.html;3193.2336239302567;3208.6310074341445;3255.153660048387;3256.0720194744504;3256.7068963793254;5168.379794424665;5214.478552144784;5240.37115546134;5268.525832675058;5269.973650131748;5216.7391630418515;5243.895122097556;5249.947500524993;5310.123829568117;5325.893482130355;4814.975925120379;4881.951180488203;4915.041566894457;4927.50724927508;4970.701757894538;4772.04559088182;4852.611791056707;4880.829170979016;4918.606511479073;4976.427710813248;4710.128626204163;4821.7830197641015;4826.058918510892;4828.46886842447;4916.360873086512;4755.476897541268;4836.951630483685;4837.274408838667;4848.7090774553635;4853.781579828917;4806.375171227753;4807.230843065093;4814.1334559779225;4817.421909370898;4819.228923372244;5038.899222015539;5113.463086375914;5145.716985565792;5154.304168937183;5193.740312984336;5600.27196464457;5629.60592758507;5639.971800140973;5642.858928526779;5647;5663.037283661746;5665.461781130786;5665.830025099253;5673.404292549264;5678;5289.894202115936;5303.390110137345;5355.946440535545;5360.731963401814;5369.8389048329;5762.538996880324;5765.798197063166;5806.1581070744505;5812.38969908162;5872.941270587325;5606.747696353674;5610.887782244332;5616;5616.971915140398;5629.296337957755;5502.8349149525575;5507.311586051744;5610.046292130348;5648.830535083954;5677.858053548694;5522.199281104217;5578.776848925998;5589.161625756169;5592.720363981784;5659.6321239119325;5582.553395728332;5589.664620122806;5591.4688104629995;5599.776008959678;5607.719614019365;4170.35359519275;4254.085371645049;4260.446142001582;4272.957270427318;4293.656507479394;3843.788591627487;3846.7114966377076;3876.205377897524;3889.844406223776;3925.666318362914;5417.674939503642;5430.429804870431;5431.945680543223;5432.266644003088;5481.424450432727;5538.501534861882;5613.438656134354;5640.294963129609;5693.17448969897;5765.106408506688;5287.101192797157;5311.946880531223;5318.388385335658;5322.733863306897;5331.760070796823;4847.933454639973;4852.296417019583;4853.223484242575;4863.10032643962;4908.3619129513645;5760.452756988079;5829;5946.643201407929;5987.461128498456;6027.939720602825;5559.27729395176;5567.276254086943;5568.470995255444;5591.21722958778;5591.8881622368135;5764.279465066867;5809.738561764815;5827.912581311199;5830.9416905832095;5839.8540036497725;5518.917216241679;5578.442155784389;5690.943090569207;5717.485426311652;5736.397678243724;5610.382857885547;5647.29408823897;5653.915191272216;5654.434556544313;5666.9716651416475;5417.160340147283;5493.340799104133;5512.200730893917;5527.917081243704;5528.695921724183;5480.095784195563;5482.890342193214;5508.063629182969;5511.283533140666;5515.034868898007;5411.377691565521;5431.293931788842;5435;5451.345838499246;5453;5506.284183056177;5532.640378375393;5589.720513974366;5600.69196194197;5610.49505544503;5362.195670649434;5407.351117865881;5408.161734931092;5425.050616142238;5427.375851777097 01:19:57 INFO - PROCESS | 15026 | |1;ext.html;528.5269683633148;532.3691425660593;556.702164342077;557.7979454276034;574.0012378461478;35350.2929941401;35600.2879942401;35750.284994300164;35805.82097089514;35832;35998.640013599856;36453.817730911374;36675.63324366756;36697.633023669754;36928.63071369285;8186.631601577928;8239.464434811747;8315.542645154514;8341.290990265805;8367.28878045367;8017.478863873829;8380.329573634095;8390.580470976458;8392.412531122824;8404;8345.54099524526;8447.070822209553;8455.154484551556;8473.95763021184;8477.321814254876;8365.372597055215;8395.496270223806;8423.36824738144;8430.662773489054;8455.873161902577;8260.917390826075;8344.249017588385;8355.331573474108;8384.622691978875;8410.621522031463;34968.475472867925;35258.47112293317;35666.465003024976;35713.46429803555;35792.46311305332;2974.2118338640275;3218.4850423932294;3248.220427097503;3305.471124620073;3346.4143774839304;29402.117936461942;29911.850440747876;30306.242343941358;30772.2306942326;31317.530237046463;3251.0734440684528;3759.191773768653;3791.473924260341;3846.6345697158727;3878.806059697004;213931;215793;216643;216819;216990.91504542535;55027.44972550304;55749;56356.718216408655;60041;61204;54080.459195407544;54499.727501363035;54576.72711636496;54612.453875461535;54742;13487.527936522174;13786.310684465736;14042.789358159636;14074.929625351808;14095.295235238196;9816.214702823758;9953.651622193189;9979.251556133318;10055.195584353234;10056.34633748804;20031.599368012558;20156.798432015494;20276.695849562268;20361.49096272605;20456.079476423598;7981.201879812089;8181.118342781075;8209.302209312274;8224.874547671847;8309.542975136304;891.6299735609649;987.8370068938544;988.2341185581232;992.4987881120132;1122.921395502307;27461.588076178872;29896.40207195844;30975.69024309728;31037.224069397995;31248.375032499676;1026.5534492495788;1042.8435734639866;1054.7679510507676;1064.627380416848;1120.6357933671588;13557;13570.728585428236;16234.837651623333;16328.75506867398;16438.589035273973;385412;387350;387375;390733;391049;53823.73088134534;53833.46166538363;54196.187057194176;54337;54546.727266363414;1319.3864852843474;1366.501227052099;1370.3353873371407;1372.3687103932104;1376.4356613788298;28158.85920570466;29255.707442925297;29442.558361625022;29550;29608.40783184281;44035;44078.779606101765;44553.777231113636;44614.3307850376;44699.77650111729;304520;305407;306331;306398;306709;31409.68590314159;42354.364684530374;42787;42791.572084278756;42809.57190428056;44466.55533444624;45054;45430.77284613556;45520.77239613781;45873.31190032219;34679.65320346865;35841.134326867665;35878.28243435064;36021;36201;35891.64108358883;36263.27473450464;36509.817450912575;36708;36770.632293677794;35440.29119417649;37300.253994920495;37438;37500.43749343816;37908.241835163695;28268.55123674928;31598.684013159575;31990.36019279648;32067.518987215677;32274.677253228107;24370.390740231636;24410.145644902343;24717.629235561122;24833.385829920997;25012.62481062749 01:19:57 INFO - PROCESS | 15026 | |2;jquery.html;363.6363636363636;365.05268827392905;365.0872817955112;366.61505419309725;367.1482161385585;15610.375584976602;16625.750613740773;16680.83319166808;17346.132693365314;17713.291468341282;15821.683566328666;16079.11564863932;16264;16298.429554965578;16521.586960325996;4659.254519276917;4841.588464980481;4858.368412106422;4867.464578896319;4867.586255168315;4775.832845850396;4857.222844344906;4860.878478038042;5087.389513258414;5311.336082989626;5054.292399064134;5257.211418287249;5265.947340526584;5300.761465734032;5327.360716713981;5173.896522069537;5199.896002079956;5224.895502089956;5243.764030618631;5395.271638328814;5202.791888324463;5215.400228973641;5219.347581552306;5234.947650523484;5240.816571419982;13222.603321900358;19059.42821715351;19654.410367688994;19656.312029079058;19786.20855165806;1939.9127039283267;1962.8429725621916;1976.802319768026;2042.018652766962;2209.304069218207;8463.322934165251;9037.774055648595;9056.637734490612;9262.351635385527;10399.428031458267;1755.806861245262;1783.580858498252;1800.558863078541;1804.1159831682512;1818.7453756473972;53231.73384133055;54857.45142548563;55040.72479637616;55942.72028639871;56829.43170568283;10099.848502272473;10217.386956782468;10221.9488902555;10246.846297305547;10280.794384112276;13374.799378009338;13390.397432115578;13418.932905335607;13546.05177637556;13547.86452135466;6917.79246622592;6921.688524016431;6941.132358455193;6984.057152284377;7053.365197132282;6410.551261411656;6416.326285740023;6444.548881578245;6449.258335291408;6480.222373315232;4411.139827733561;4504.887377815581;4517.141743068806;4522.977385113053;4551.704139230939;1782.875198736102;1881.698928171486;1920.4238728381429;1926.1428664244556;1961.0782932021928;927.420362273579;934.5233930695395;971.5385192033727;983.4935008470643;999.2505620784411;15342.386304547916;15777.526674199793;15978;16301.266443010092;16370.099644519427;867.0549101479291;871.6731225790329;875.3916028360355;924.861270809384;928.3733479901175;9341.953290233505;9500.857487137699;9565.947745747962;9604.471754053455;9807.26445516589;387431;390806;390817;395027;459825;46296.7685161572;59989.40010599925;65159.34840651628;72210.63894680493;72841.27158728451;1073.6939972107912;1082.3722241100143;1084.8643919510062;1098.373926861697;1101.7686285879895;14626.414943402146;14743.336549855498;14820.481283155037;14880.85119148838;15029.098254104789;31073.53389699111;31149.377012460078;31158.065258042294;31585.8420707895;31993.68006319907;42071.36892946547;42418;42664.78667606766;42954.78522607367;44811.55188448074;6997.230304666585;7024.578525288499;7133.144022717307;7160.713571457083;7213.1704853942465;10176.949115254376;10382.169426446017;10573.418461984666;10858.2399232053;11250.606228781953;9185.494797786187;9295.488748118647;9393;9496.14534691881;9662.516874156405;9184.622306654055;9389.953050234704;9645.42127472354;9647.372920760128;9871.605135794487;9158.496282704515;9274.814503710022;9436.386634868712;9649.276304277068;9822.165115965223;7050;7265.709371625076;7329.193788683134;7495.325420712162;7590.240975902366;9025.458472491671;9053.419775364253;9067.727968160965;9569.61721531131;9629.32594718363 01:19:57 INFO - PROCESS | 15026 | |3;mootools.html;1486.5094518808792;1498.8351281359048;1685.8314168583142;1802.97295540567;1814.7187185986168;7864.292213700765;7864.4101692373015;7883.881741773878;8056.1943805619485;8090.635921383538;7965.641546130423;7982.680692772282;7987.361011119111;8046.678132874678;8068.91931080689;2325.686032385623;2355.8586484810967;2368.2895131460577;2374.1809075868796;2377.393764590036;2358.3986083548757;2388.95222095558;2393.3298676370646;2398.436367453647;2407.554602398553;2297.529006553661;2335.567919934809;2349.4713689419827;2368.017272831773;2368.2539999900064;2369.9052037918464;2399.6280576510667;2410.240774156135;2419.794317483016;2425.151197081025;2370.573296806574;2373.679553260305;2374.726906405768;2379.7144342678816;2401.7598240176017;7910.920890791133;7972.760817175494;7997.400194985399;8000.119971806621;8016.799580010488;4900.901981960376;5049.863780649362;5077.49225077493;5081.720505372203;5096.05722941257;3039.574459575661;3080.537919312121;3112.175273552488;3114.174743692923;3129.436701393748;1028.4189432970422;1039.111559616532;1077.3589714120087;1094.042712626452;1103.4979084516526;11051;11155.330680159297;11182.944085279603;11193.216474846764;11200.607978720787;4270.188664153801;4374.103308821684;4411.2721400968485;4419.624331931822;4530.478994915561;9108.681196158102;9132.589033493508;9137.269018478506;9153.17621414076;9162.81674366509;4733.077049975291;4745.810167593327;4791.137595232892;4810.687305325143;4812.302216178705;4316.568343165721;4331.870043898688;4334.891627709269;4341.696081274281;4346.956530434655;3516.9624960636675;3551.5027896094566;3560.590532088791;3566.1262990567475;3602.243528858969;1109.2013750099916;1112.3826276416505;1118.692359601116;1126.4536699700639;1154.3074155506629;1259.1563652352945;1270.9237445753283;1294.8769866862633;1303.2636560343565;1313.2317594207495;7195.712171513185;7210.423166146696;7245.094363204599;7259.310365515267;7275.308845659654;1125.4372813593204;1143.0969534067992;1155.1625071822862;1155.2086820527966;1164.1036401970434;5394.514493695587;5485.396606373296;5516.14499752539;5550.861228469321;5554.50009499147;9516.571754271074;9519.762005949906;9910.80178396428;9943.80112397748;9957;9631.71104866855;9656.179224765832;9714.271429642806;9716.271279653913;9727.221822254203;7509.211532789088;7523.623818809037;7559.1306999695735;7626.6186690665245;7654.387648988068;7054.224035356004;7074;7083.929160708327;7113.0753002109395;7113.964430177816;8494.787630309293;8610.569471526524;8717.607707653044;8808.163224493663;8838.204561589488;8864.86702699447;8976.640934362813;8991.595378207865;9009.639614415612;9066.727998160066;6725.361090696376;6731.932680673326;6837.384635382839;6840.794776156723;6846.041554182518;7657.272559106876;7758.340541054074;7820.960895195488;7855.646495907584;7860.921390786248;6985.1617805863625;7129.500934934505;7415.666295016845;7489.513181643176;7614.847703045797;7018.75434359795;7073.151221853411;7117.8932316016335;7127.322904324081;7176.856462870818;6947.096877405905;7035.753748618774;7061.2585678505075;7064.222935477196;7126.35862772353;6267.2479302484;6306;6311.337309582428;6316.842078948063;6317.5893566918;6328.968355158195;6475.967620161869;6489.253735820253;6499.025146228104;6500.642464664489 01:19:57 INFO - PROCESS | 15026 | |4;prototype.html;345.0528299817002;350.4043126684635;354.38337293109964;355.30183190031585;355.75630692975307;6187.0719392091205;6233.563650544464;6234.750609975601;6248.125262463253;6417.775377861776;6178.598391104575;6188.257409110902;6193.318734939165;6203.937960620404;6213.254409470858;4780.880477988043;4782.880427989293;4788.090262850047;4795.040991801636;4807.903841923159;4803.2795080738;4808.591269742059;4810.97594512027;4812.181929072049;4816.903661926759;4666.090112428078;4740.90518189636;4761.50004249554;4774.68964517307;4774.785134668949;4725.740084295362;4728.361671174382;4749.833755818529;4757.262624293223;4773.331733557287;4109.0959988802415;4131.256373852705;4146.91706165878;4150.481189851269;4164.75011499311;5902.970485147547;5942.64344139353;5955.136505206764;5962.5528085393335;5975.223220981288;5384.300040994645;5487.75305111271;5533.501984821385;5538.778448862041;5547.195656629807;6578.539502234846;6578.736850525973;6580.14458120446;6582.210134783809;6584.374484423972;4583.564561366665;4586.1744885920525;4588.701734387254;4598.126355992351;4615.353850460938;6604.811133995879;6768.93231067688;6830.282820303896;6851.48613853963;6863.416609588191;4619.653525985497;4622.168009758276;4625.629949604024;4661.673682842168;4669.579737823544;4714.175019371596;4720.291956206596;4720.480747117815;4724.763761811896;4729.196036673774;5454.509094181542;5460.590455715757;5463.726813659301;5465.890682186414;5468.207109969032;6391.201099862517;6551.344865513506;6579.736810527621;6594.901076483857;6594.967025164843;1630.8124565674862;1650.818409974902;1675.9748603770954;1684.4693921414714;1686.7385555238957;1099.2964502718266;1102.2504696806088;1105.8783533811275;1113.1150735165563;1121.8373335866254;6198.876022479525;6213.130161777355;6215.254169499599;6219.222597175353;6246.6876656167005;6628.171478565179;6659.833504162435;6677.599344039373;6692.899606505906;6716.5634233774645;6099.054646529795;6207.068939659087;6209.565330426827;6224.221972253468;6226.501879849601;3633.182533929845;3646.124930016777;3652.7990960497427;3660.194757153422;3661.9816900915857;7063.293670632998;7077.858442831114;7077.929220707727;7090.397316228075;7093.361597456254;6652.634105124168;6847.554908930903;6857.897131543031;6858.931410685929;6869.072675188885;6994.93005069953;7007.789766307019;7037.22590515043;7048.189458212371;7054.6472676365975;6653.068570400244;6685.498587606046;6693.497987651043;6694.698738556679;6698.39714425704;6473.468571999525;6548.901766473602;6572.967135164294;6603.603783772989;6616.2722100567935;6940;7009.1589009319205;7010.26392228829;7020.859582808417;7037.824054398681;4625.352450656844;4638.373819534319;4640.3735495709;4676.649251306234;4697.553732395417;6711.0940023096255;6715.127033485615;6721.764738234138;6733.663316834237;6864.2106157790495;6586.50601204902;6605.900911486236;6637.834054148685;6641.169853768279;6643.800685979429;6566.6388348641285;6590.80227593173;6593.967030164818;6596.043573681885;6620.040094186413;6322.8735425290315;6466.32103629131;6482.870342593027;6487.448566871869;6493.026046092935;6624.8012559623285;6634.535582509178;6654.767083152066;6659.267480577229;6664.200295964515;6476.06097115925;6482.935170648233;6500.317466666121;6513.250976137805;6538.280789113289 01:19:57 INFO - PROCESS | 15026 | |5;yui.html;733.5268751655183;779.9103103143136;780.8204113053997;820.085604550926;840.9032961209463;12804.871951280484;12971.221726696393;13079.476820927164;13112.868871311284;13115.934420327909;12628.81056784149;12659.30373829439;12660.746785064317;12679.302638354888;12733.236005839655;798.3413683710933;799.0371602219341;815.4088285992667;818.8116733151379;822.5023860564362;810.4610434061372;814.6904176412985;822.3051521464353;822.6462621072936;825.8719898415756;851.2679095977485;853.5007020892754;854.4104567848196;859.179483593167;861.0227391910196;841.8526757817388;842.8019415437367;848.6817443458702;849.8130411309502;851.3487182305541;628.7547856336032;630.6310808177221;631.8167731357946;632.0140580694132;634.3688030409771;13255.337233138402;13602.183868967893;13610.251436171007;13642.454301827915;13717.108387954751;12501.687457813536;12521.248725076433;12612;12795.360909484876;12881.420336084899;10625.574977000988;10677.679669609925;10740.570377184982;10749.78500429987;10770.515326810313;3563.7861728296384;3591.856325746967;3635.8909232723063;3722.40441529354;3731.533558305212;45849;45852.3122153168;45993.5400645996;46356.76821615904;46482.302765458546;9662.178714809179;9710.95144524287;9730.562124704406;9772.21822254218;9792.51037448139;16582.17089145538;16608.418705345255;16627;16663.583410414838;17536;7524.623768811538;7626.504277221963;7683.385329173652;7746.535207887545;7789.766307010798;4217.219814334358;4254.234237837219;4254.489461264668;4304.053108316165;4320.4167437395545;3147.889823856154;3155.2742869140225;3179;3184.2835362043356;3191.920201994969;572.3303734630492;577.7515668262604;585.7920438244362;586.1354502109355;605.1558076483282;489.9142650036229;529.7324850950323;554.3929397309939;595.6336852835475;606.1483615520201;8128.75613731589;8267.586620669063;8332.125126861714;8427.241548260687;8624.051354351017;458.660591162544;487.6026038778384;561.2339157050596;631.2677294338545;645.8407159149244;3929.44987701722;3972.980135099364;3993.5407428146136;4005.998500374906;4141.006158521933;53481.465185348425;54213.728931355094;54342.72828635832;54609.180862287096;55472.445275547536;46566.76716616463;46723.766381168556;46845.76577117161;47120.7643961778;47136.52863471321;43736;44654;44891.55108448939;45016.3247551287;46926;8303.211194936472;8361.289290410383;8435.91564084376;8502.813174327086;8740.562971851255;33805;33913.49129763006;34038;34081.65918340884;34729.47905781466;38220.80889595534;42851.357229642206;42885.785571071945;42893;42926.570734292254;9825.705228843146;10015.399076055168;10220;10659.8934010662;10693.679189624323;11079.897956144927;11248.931351521593;11754.412279385826;12011.75976480483;12072.094592905743;10671.733206669895;10758.677239682822;10771.784564308513;10835.458227088457;11362.488688008894;10926.890731092588;10965.671029869116;11254.268472549586;11294.548218071184;11351.886481135083;10132.645357412455;10142.847857281999;10386.740331491774;10504.894951050392;10632.202584806326;8879.733607991771;8947.239484643878;9040.141186587263;9153.084691530794;9294.907050929674;8050.27547520726;8358.791030224049;8597;8994.235489983163;9333.439993600134 01:19:57 INFO - PROCESS | 15026 | __end_tp_report 01:19:57 INFO - PROCESS | 15026 | __start_cc_report 01:19:57 INFO - PROCESS | 15026 | _x_x_mozilla_cycle_collect,313 01:19:57 INFO - PROCESS | 15026 | __end_cc_report 01:19:57 INFO - PROCESS | 15026 | __startTimestamp1452763197617__endTimestamp 01:19:57 INFO - PROCESS | 15026 | 01:19:57 INFO - PROCESS | 15026 | ------- Summary: start ------- 01:19:57 INFO - PROCESS | 15026 | Number of tests: 6 01:19:57 INFO - PROCESS | 15026 | 01:19:57 INFO - PROCESS | 15026 | [#0] dojo.html Cycles:165 Average:5252.49 Median:5435.00 stddev:572.93 (10.5%) stddev-sans-first:551.44 01:19:57 INFO - PROCESS | 15026 | Values: 3193.2 3208.6 3255.2 3256.1 3256.7 5168.4 5214.5 5240.4 5268.5 5270.0 5216.7 5243.9 5249.9 5310.1 5325.9 4815.0 4882.0 4915.0 4927.5 4970.7 4772.0 4852.6 4880.8 4918.6 4976.4 4710.1 4821.8 4826.1 4828.5 4916.4 4755.5 4837.0 4837.3 4848.7 4853.8 4806.4 4807.2 4814.1 4817.4 4819.2 5038.9 5113.5 5145.7 5154.3 5193.7 5600.3 5629.6 5640.0 5642.9 5647.0 5663.0 5665.5 5665.8 5673.4 5678.0 5289.9 5303.4 5355.9 5360.7 5369.8 5762.5 5765.8 5806.2 5812.4 5872.9 5606.7 5610.9 5616.0 5617.0 5629.3 5502.8 5507.3 5610.0 5648.8 5677.9 5522.2 5578.8 5589.2 5592.7 5659.6 5582.6 5589.7 5591.5 5599.8 5607.7 4170.4 4254.1 4260.4 4273.0 4293.7 3843.8 3846.7 3876.2 3889.8 3925.7 5417.7 5430.4 5431.9 5432.3 5481.4 5538.5 5613.4 5640.3 5693.2 5765.1 5287.1 5311.9 5318.4 5322.7 5331.8 4847.9 4852.3 4853.2 4863.1 4908.4 5760.5 5829.0 5946.6 5987.5 6027.9 5559.3 5567.3 5568.5 5591.2 5591.9 5764.3 5809.7 5827.9 5830.9 5839.9 5518.9 5578.4 5690.9 5717.5 5736.4 5610.4 5647.3 5653.9 5654.4 5667.0 5417.2 5493.3 5512.2 5527.9 5528.7 5480.1 5482.9 5508.1 5511.3 5515.0 5411.4 5431.3 5435.0 5451.3 5453.0 5506.3 5532.6 5589.7 5600.7 5610.5 5362.2 5407.4 5408.2 5425.1 5427.4 01:19:57 INFO - PROCESS | 15026 | 01:19:57 INFO - PROCESS | 15026 | [#1] ext.html Cycles:180 Average:46930.52 Median:36592.73 stddev:81911.76 (223.8%) stddev-sans-first:82067.45 01:19:57 INFO - PROCESS | 15026 | Values: 528.5 532.4 556.7 557.8 574.0 35350.3 35600.3 35750.3 35805.8 35832.0 35998.6 36453.8 36675.6 36697.6 36928.6 8186.6 8239.5 8315.5 8341.3 8367.3 8017.5 8380.3 8390.6 8392.4 8404.0 8345.5 8447.1 8455.2 8474.0 8477.3 8365.4 8395.5 8423.4 8430.7 8455.9 8260.9 8344.2 8355.3 8384.6 8410.6 34968.5 35258.5 35666.5 35713.5 35792.5 2974.2 3218.5 3248.2 3305.5 3346.4 29402.1 29911.9 30306.2 30772.2 31317.5 3251.1 3759.2 3791.5 3846.6 3878.8 213931.0 215793.0 216643.0 216819.0 216990.9 55027.4 55749.0 56356.7 60041.0 61204.0 54080.5 54499.7 54576.7 54612.5 54742.0 13487.5 13786.3 14042.8 14074.9 14095.3 9816.2 9953.7 9979.3 10055.2 10056.3 20031.6 20156.8 20276.7 20361.5 20456.1 7981.2 8181.1 8209.3 8224.9 8309.5 891.6 987.8 988.2 992.5 1122.9 27461.6 29896.4 30975.7 31037.2 31248.4 1026.6 1042.8 1054.8 1064.6 1120.6 13557.0 13570.7 16234.8 16328.8 16438.6 385412.0 387350.0 387375.0 390733.0 391049.0 53823.7 53833.5 54196.2 54337.0 54546.7 1319.4 1366.5 1370.3 1372.4 1376.4 28158.9 29255.7 29442.6 29550.0 29608.4 44035.0 44078.8 44553.8 44614.3 44699.8 304520.0 305407.0 306331.0 306398.0 306709.0 31409.7 42354.4 42787.0 42791.6 42809.6 44466.6 45054.0 45430.8 45520.8 45873.3 34679.7 35841.1 35878.3 36021.0 36201.0 35891.6 36263.3 36509.8 36708.0 36770.6 35440.3 37300.3 37438.0 37500.4 37908.2 28268.6 31598.7 31990.4 32067.5 32274.7 24370.4 24410.1 24717.6 24833.4 25012.6 01:19:57 INFO - PROCESS | 15026 | 01:19:57 INFO - PROCESS | 15026 | [#2] jquery.html Cycles:180 Average:23260.71 Median:4857.80 stddev:66384.16 (1366.5%) stddev-sans-first:66548.12 01:19:57 INFO - PROCESS | 15026 | Values: 363.6 365.1 365.1 366.6 367.1 15610.4 16625.8 16680.8 17346.1 17713.3 15821.7 16079.1 16264.0 16298.4 16521.6 4659.3 4841.6 4858.4 4867.5 4867.6 4775.8 4857.2 4860.9 5087.4 5311.3 5054.3 5257.2 5265.9 5300.8 5327.4 5173.9 5199.9 5224.9 5243.8 5395.3 5202.8 5215.4 5219.3 5234.9 5240.8 13222.6 19059.4 19654.4 19656.3 19786.2 1939.9 1962.8 1976.8 2042.0 2209.3 8463.3 9037.8 9056.6 9262.4 10399.4 1755.8 1783.6 1800.6 1804.1 1818.7 53231.7 54857.5 55040.7 55942.7 56829.4 10099.8 10217.4 10221.9 10246.8 10280.8 13374.8 13390.4 13418.9 13546.1 13547.9 6917.8 6921.7 6941.1 6984.1 7053.4 6410.6 6416.3 6444.5 6449.3 6480.2 4411.1 4504.9 4517.1 4523.0 4551.7 1782.9 1881.7 1920.4 1926.1 1961.1 927.4 934.5 971.5 983.5 999.3 15342.4 15777.5 15978.0 16301.3 16370.1 867.1 871.7 875.4 924.9 928.4 9342.0 9500.9 9565.9 9604.5 9807.3 387431.0 390806.0 390817.0 395027.0 459825.0 46296.8 59989.4 65159.3 72210.6 72841.3 1073.7 1082.4 1084.9 1098.4 1101.8 14626.4 14743.3 14820.5 14880.9 15029.1 31073.5 31149.4 31158.1 31585.8 31993.7 42071.4 42418.0 42664.8 42954.8 44811.6 6997.2 7024.6 7133.1 7160.7 7213.2 10176.9 10382.2 10573.4 10858.2 11250.6 9185.5 9295.5 9393.0 9496.1 9662.5 9184.6 9390.0 9645.4 9647.4 9871.6 9158.5 9274.8 9436.4 9649.3 9822.2 7050.0 7265.7 7329.2 7495.3 7590.2 9025.5 9053.4 9067.7 9569.6 9629.3 01:19:57 INFO - PROCESS | 15026 | 01:19:57 INFO - PROCESS | 15026 | [#3] mootools.html Cycles:180 Average:5582.60 Median:6286.62 stddev:2896.11 (46.1%) stddev-sans-first:2887.87 01:19:57 INFO - PROCESS | 15026 | Values: 1486.5 1498.8 1685.8 1803.0 1814.7 7864.3 7864.4 7883.9 8056.2 8090.6 7965.6 7982.7 7987.4 8046.7 8068.9 2325.7 2355.9 2368.3 2374.2 2377.4 2358.4 2389.0 2393.3 2398.4 2407.6 2297.5 2335.6 2349.5 2368.0 2368.3 2369.9 2399.6 2410.2 2419.8 2425.2 2370.6 2373.7 2374.7 2379.7 2401.8 7910.9 7972.8 7997.4 8000.1 8016.8 4900.9 5049.9 5077.5 5081.7 5096.1 3039.6 3080.5 3112.2 3114.2 3129.4 1028.4 1039.1 1077.4 1094.0 1103.5 11051.0 11155.3 11182.9 11193.2 11200.6 4270.2 4374.1 4411.3 4419.6 4530.5 9108.7 9132.6 9137.3 9153.2 9162.8 4733.1 4745.8 4791.1 4810.7 4812.3 4316.6 4331.9 4334.9 4341.7 4347.0 3517.0 3551.5 3560.6 3566.1 3602.2 1109.2 1112.4 1118.7 1126.5 1154.3 1259.2 1270.9 1294.9 1303.3 1313.2 7195.7 7210.4 7245.1 7259.3 7275.3 1125.4 1143.1 1155.2 1155.2 1164.1 5394.5 5485.4 5516.1 5550.9 5554.5 9516.6 9519.8 9910.8 9943.8 9957.0 9631.7 9656.2 9714.3 9716.3 9727.2 7509.2 7523.6 7559.1 7626.6 7654.4 7054.2 7074.0 7083.9 7113.1 7114.0 8494.8 8610.6 8717.6 8808.2 8838.2 8864.9 8976.6 8991.6 9009.6 9066.7 6725.4 6731.9 6837.4 6840.8 6846.0 7657.3 7758.3 7821.0 7855.6 7860.9 6985.2 7129.5 7415.7 7489.5 7614.8 7018.8 7073.2 7117.9 7127.3 7176.9 6947.1 7035.8 7061.3 7064.2 7126.4 6267.2 6306.0 6311.3 6316.8 6317.6 6329.0 6476.0 6489.3 6499.0 6500.6 01:19:57 INFO - PROCESS | 15026 | 01:19:57 INFO - PROCESS | 15026 | [#4] prototype.html Cycles:180 Average:5492.43 Median:6214.25 stddev:1645.72 (26.5%) stddev-sans-first:1604.34 01:19:57 INFO - PROCESS | 15026 | Values: 345.1 350.4 354.4 355.3 355.8 6187.1 6233.6 6234.8 6248.1 6417.8 6178.6 6188.3 6193.3 6203.9 6213.3 4780.9 4782.9 4788.1 4795.0 4807.9 4803.3 4808.6 4811.0 4812.2 4816.9 4666.1 4740.9 4761.5 4774.7 4774.8 4725.7 4728.4 4749.8 4757.3 4773.3 4109.1 4131.3 4146.9 4150.5 4164.8 5903.0 5942.6 5955.1 5962.6 5975.2 5384.3 5487.8 5533.5 5538.8 5547.2 6578.5 6578.7 6580.1 6582.2 6584.4 4583.6 4586.2 4588.7 4598.1 4615.4 6604.8 6768.9 6830.3 6851.5 6863.4 4619.7 4622.2 4625.6 4661.7 4669.6 4714.2 4720.3 4720.5 4724.8 4729.2 5454.5 5460.6 5463.7 5465.9 5468.2 6391.2 6551.3 6579.7 6594.9 6595.0 1630.8 1650.8 1676.0 1684.5 1686.7 1099.3 1102.3 1105.9 1113.1 1121.8 6198.9 6213.1 6215.3 6219.2 6246.7 6628.2 6659.8 6677.6 6692.9 6716.6 6099.1 6207.1 6209.6 6224.2 6226.5 3633.2 3646.1 3652.8 3660.2 3662.0 7063.3 7077.9 7077.9 7090.4 7093.4 6652.6 6847.6 6857.9 6858.9 6869.1 6994.9 7007.8 7037.2 7048.2 7054.6 6653.1 6685.5 6693.5 6694.7 6698.4 6473.5 6548.9 6573.0 6603.6 6616.3 6940.0 7009.2 7010.3 7020.9 7037.8 4625.4 4638.4 4640.4 4676.6 4697.6 6711.1 6715.1 6721.8 6733.7 6864.2 6586.5 6605.9 6637.8 6641.2 6643.8 6566.6 6590.8 6594.0 6596.0 6620.0 6322.9 6466.3 6482.9 6487.4 6493.0 6624.8 6634.5 6654.8 6659.3 6664.2 6476.1 6482.9 6500.3 6513.3 6538.3 01:19:57 INFO - PROCESS | 15026 | 01:19:57 INFO - PROCESS | 15026 | [#5] yui.html Cycles:180 Average:13216.28 Median:45922.93 stddev:15073.49 (32.8%) stddev-sans-first:15086.63 01:19:57 INFO - PROCESS | 15026 | Values: 733.5 779.9 780.8 820.1 840.9 12804.9 12971.2 13079.5 13112.9 13115.9 12628.8 12659.3 12660.7 12679.3 12733.2 798.3 799.0 815.4 818.8 822.5 810.5 814.7 822.3 822.6 825.9 851.3 853.5 854.4 859.2 861.0 841.9 842.8 848.7 849.8 851.3 628.8 630.6 631.8 632.0 634.4 13255.3 13602.2 13610.3 13642.5 13717.1 12501.7 12521.2 12612.0 12795.4 12881.4 10625.6 10677.7 10740.6 10749.8 10770.5 3563.8 3591.9 3635.9 3722.4 3731.5 45849.0 45852.3 45993.5 46356.8 46482.3 9662.2 9711.0 9730.6 9772.2 9792.5 16582.2 16608.4 16627.0 16663.6 17536.0 7524.6 7626.5 7683.4 7746.5 7789.8 4217.2 4254.2 4254.5 4304.1 4320.4 3147.9 3155.3 3179.0 3184.3 3191.9 572.3 577.8 585.8 586.1 605.2 489.9 529.7 554.4 595.6 606.1 8128.8 8267.6 8332.1 8427.2 8624.1 458.7 487.6 561.2 631.3 645.8 3929.4 3973.0 3993.5 4006.0 4141.0 53481.5 54213.7 54342.7 54609.2 55472.4 46566.8 46723.8 46845.8 47120.8 47136.5 43736.0 44654.0 44891.6 45016.3 46926.0 8303.2 8361.3 8435.9 8502.8 8740.6 33805.0 33913.5 34038.0 34081.7 34729.5 38220.8 42851.4 42885.8 42893.0 42926.6 9825.7 10015.4 10220.0 10659.9 10693.7 11079.9 11248.9 11754.4 12011.8 12072.1 10671.7 10758.7 10771.8 10835.5 11362.5 10926.9 10965.7 11254.3 11294.5 11351.9 10132.6 10142.8 10386.7 10504.9 10632.2 8879.7 8947.2 9040.1 9153.1 9294.9 8050.3 8358.8 8597.0 8994.2 9333.4 01:19:57 INFO - PROCESS | 15026 | -------- Summary: end -------- 01:19:57 INFO - PROCESS | 15026 | 01:19:58 INFO - TEST-INFO | 15026: exit 0 01:19:58 INFO - TEST-OK | dromaeo_css | took 1110786ms 01:19:58 INFO - TEST-START | kraken 01:19:58 INFO - operating with platform_type : linux_ 01:19:58 INFO - Initialising browser for kraken test... 01:19:58 INFO - TEST-INFO | started process 15267 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpLL30du/profile http://localhost:57274/getInfo.html) 01:20:02 INFO - PROCESS | 15267 | 01:20:02 INFO - PROCESS | 15267 | (process:15340): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 01:20:03 INFO - PROCESS | 15267 | __metrics Screen width/height:1600/1200 01:20:03 INFO - PROCESS | 15267 | colorDepth:24 01:20:03 INFO - PROCESS | 15267 | Browser inner width/height: 1024/697 01:20:03 INFO - PROCESS | 15267 | __metrics 01:20:03 INFO - PROCESS | 15267 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 01:20:04 INFO - TEST-INFO | 15267: exit 0 01:20:04 INFO - Browser initialized. 01:20:04 INFO - Running cycle 1/1 for kraken test... 01:20:04 INFO - TEST-INFO | started process 15389 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpLL30du/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 01:20:05 INFO - PROCESS | 15389 | 01:20:05 INFO - PROCESS | 15389 | (process:15451): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 01:20:16 INFO - PROCESS | 15389 | RSS: Main: 150765568 01:20:16 INFO - PROCESS | 15389 | 01:20:18 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:57274/tests/kraken/driver.html?testName=audio-beat-detection) 01:20:19 INFO - PROCESS | 15389 | RSS: Main: 150859776 01:20:19 INFO - PROCESS | 15389 | 01:20:21 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:57274/tests/kraken/driver.html?testName=audio-dft) 01:20:22 INFO - PROCESS | 15389 | RSS: Main: 154497024 01:20:22 INFO - PROCESS | 15389 | 01:20:25 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:57274/tests/kraken/driver.html?testName=audio-fft) 01:20:25 INFO - PROCESS | 15389 | RSS: Main: 145702912 01:20:25 INFO - PROCESS | 15389 | 01:20:28 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:57274/tests/kraken/driver.html?testName=audio-oscillator) 01:20:28 INFO - PROCESS | 15389 | RSS: Main: 146714624 01:20:28 INFO - PROCESS | 15389 | 01:20:31 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:57274/tests/kraken/driver.html?testName=imaging-gaussian-blur) 01:20:31 INFO - PROCESS | 15389 | RSS: Main: 147648512 01:20:31 INFO - PROCESS | 15389 | 01:20:34 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:57274/tests/kraken/driver.html?testName=imaging-darkroom) 01:20:35 INFO - PROCESS | 15389 | RSS: Main: 148574208 01:20:35 INFO - PROCESS | 15389 | 01:20:38 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:57274/tests/kraken/driver.html?testName=imaging-desaturate) 01:20:39 INFO - PROCESS | 15389 | RSS: Main: 148942848 01:20:39 INFO - PROCESS | 15389 | 01:20:42 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:57274/tests/kraken/driver.html?testName=json-parse-financial) 01:20:42 INFO - PROCESS | 15389 | RSS: Main: 149426176 01:20:42 INFO - PROCESS | 15389 | 01:20:44 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:57274/tests/kraken/driver.html?testName=json-stringify-tinderbox) 01:20:44 INFO - PROCESS | 15389 | RSS: Main: 151113728 01:20:44 INFO - PROCESS | 15389 | 01:20:46 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:57274/tests/kraken/driver.html?testName=stanford-crypto-aes) 01:20:47 INFO - PROCESS | 15389 | RSS: Main: 149823488 01:20:47 INFO - PROCESS | 15389 | 01:20:49 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:57274/tests/kraken/driver.html?testName=stanford-crypto-ccm) 01:20:49 INFO - PROCESS | 15389 | RSS: Main: 150446080 01:20:49 INFO - PROCESS | 15389 | 01:20:52 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:57274/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 01:20:52 INFO - PROCESS | 15389 | RSS: Main: 150626304 01:20:52 INFO - PROCESS | 15389 | 01:20:55 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:57274/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 01:20:56 INFO - PROCESS | 15389 | RSS: Main: 151162880 01:20:56 INFO - PROCESS | 15389 | 01:20:57 INFO - PROCESS | 15389 | Cycle 1(1): loaded http://localhost:57274/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:57274/tests/kraken/driver.html?testName=ai-astar) 01:20:57 INFO - PROCESS | 15389 | RSS: Main: 150351872 01:20:57 INFO - PROCESS | 15389 | 01:20:57 INFO - PROCESS | 15389 | __start_tp_report 01:20:57 INFO - PROCESS | 15389 | _x_x_mozilla_page_load 01:20:57 INFO - PROCESS | 15389 | _x_x_mozilla_page_load_details 01:20:57 INFO - PROCESS | 15389 | |i|pagename|runs| 01:20:57 INFO - PROCESS | 15389 | |0;ai-astar;110;105;113;112;110;123;113;111;112;111 01:20:57 INFO - PROCESS | 15389 | |1;audio-beat-detection;155;125;147;170;127;153;154;129;160;124 01:20:57 INFO - PROCESS | 15389 | |2;audio-dft;162;165;164;164;168;165;166;173;168;166 01:20:57 INFO - PROCESS | 15389 | |3;audio-fft;73;75;72;72;72;74;151;76;76;75 01:20:57 INFO - PROCESS | 15389 | |4;audio-oscillator;96;98;143;96;96;96;145;96;96;154 01:20:57 INFO - PROCESS | 15389 | |5;imaging-gaussian-blur;109;110;110;110;110;110;110;110;110;110 01:20:57 INFO - PROCESS | 15389 | |6;imaging-darkroom;147;148;146;147;146;147;149;147;148;147 01:20:57 INFO - PROCESS | 15389 | |7;imaging-desaturate;97;97;96;96;97;97;97;97;98;97 01:20:57 INFO - PROCESS | 15389 | |8;json-parse-financial;62;60;59;61;58;59;58;62;56;59 01:20:57 INFO - PROCESS | 15389 | |9;json-stringify-tinderbox;69;68;68;68;69;69;68;68;69;69 01:20:57 INFO - PROCESS | 15389 | |10;stanford-crypto-aes;84;83;82;90;84;84;84;90;84;85 01:20:57 INFO - PROCESS | 15389 | |11;stanford-crypto-ccm;120;115;115;131;126;121;118;127;120;117 01:20:57 INFO - PROCESS | 15389 | |12;stanford-crypto-pbkdf2;134;147;144;145;147;131;145;149;150;150 01:20:57 INFO - PROCESS | 15389 | |13;stanford-crypto-sha256-iterative;69;68;66;67;67;68;68;67;67;66 01:20:57 INFO - PROCESS | 15389 | __end_tp_report 01:20:57 INFO - PROCESS | 15389 | __start_cc_report 01:20:57 INFO - PROCESS | 15389 | _x_x_mozilla_cycle_collect,748 01:20:57 INFO - PROCESS | 15389 | __end_cc_report 01:20:57 INFO - PROCESS | 15389 | __startTimestamp1452763257989__endTimestamp 01:20:57 INFO - PROCESS | 15389 | 01:20:57 INFO - PROCESS | 15389 | ------- Summary: start ------- 01:20:57 INFO - PROCESS | 15389 | Number of tests: 14 01:20:57 INFO - PROCESS | 15389 | 01:20:57 INFO - PROCESS | 15389 | [#0] ai-astar Cycles:10 Average:112.00 Median:112.00 stddev:4.50 (4.0%) stddev-sans-first:4.71 01:20:57 INFO - PROCESS | 15389 | Values: 110.0 105.0 113.0 112.0 110.0 123.0 113.0 111.0 112.0 111.0 01:20:57 INFO - PROCESS | 15389 | 01:20:57 INFO - PROCESS | 15389 | [#1] audio-beat-detection Cycles:10 Average:144.40 Median:153.50 stddev:16.72 (10.9%) stddev-sans-first:17.29 01:20:57 INFO - PROCESS | 15389 | Values: 155.0 125.0 147.0 170.0 127.0 153.0 154.0 129.0 160.0 124.0 01:20:57 INFO - PROCESS | 15389 | 01:20:57 INFO - PROCESS | 15389 | [#2] audio-dft Cycles:10 Average:166.10 Median:166.00 stddev:3.03 (1.8%) stddev-sans-first:2.83 01:20:57 INFO - PROCESS | 15389 | Values: 162.0 165.0 164.0 164.0 168.0 165.0 166.0 173.0 168.0 166.0 01:20:57 INFO - PROCESS | 15389 | 01:20:57 INFO - PROCESS | 15389 | [#3] audio-fft Cycles:10 Average:81.60 Median:74.50 stddev:24.44 (32.8%) stddev-sans-first:25.72 01:20:57 INFO - PROCESS | 15389 | Values: 73.0 75.0 72.0 72.0 72.0 74.0 151.0 76.0 76.0 75.0 01:20:57 INFO - PROCESS | 15389 | 01:20:57 INFO - PROCESS | 15389 | [#4] audio-oscillator Cycles:10 Average:111.60 Median:96.00 stddev:24.82 (25.9%) stddev-sans-first:25.68 01:20:57 INFO - PROCESS | 15389 | Values: 96.0 98.0 143.0 96.0 96.0 96.0 145.0 96.0 96.0 154.0 01:20:57 INFO - PROCESS | 15389 | 01:20:58 INFO - PROCESS | 15389 | [#5] imaging-gaussian-blur Cycles:10 Average:109.90 Median:110.00 stddev:0.32 (0.3%) stddev-sans-first:0.00 01:20:58 INFO - PROCESS | 15389 | Values: 109.0 110.0 110.0 110.0 110.0 110.0 110.0 110.0 110.0 110.0 01:20:58 INFO - PROCESS | 15389 | 01:20:58 INFO - PROCESS | 15389 | [#6] imaging-darkroom Cycles:10 Average:147.20 Median:147.00 stddev:0.92 (0.6%) stddev-sans-first:0.97 01:20:58 INFO - PROCESS | 15389 | Values: 147.0 148.0 146.0 147.0 146.0 147.0 149.0 147.0 148.0 147.0 01:20:58 INFO - PROCESS | 15389 | 01:20:58 INFO - PROCESS | 15389 | [#7] imaging-desaturate Cycles:10 Average:96.90 Median:97.00 stddev:0.57 (0.6%) stddev-sans-first:0.60 01:20:58 INFO - PROCESS | 15389 | Values: 97.0 97.0 96.0 96.0 97.0 97.0 97.0 97.0 98.0 97.0 01:20:58 INFO - PROCESS | 15389 | 01:20:58 INFO - PROCESS | 15389 | [#8] json-parse-financial Cycles:10 Average:59.40 Median:59.50 stddev:1.90 (3.2%) stddev-sans-first:1.76 01:20:58 INFO - PROCESS | 15389 | Values: 62.0 60.0 59.0 61.0 58.0 59.0 58.0 62.0 56.0 59.0 01:20:58 INFO - PROCESS | 15389 | 01:20:58 INFO - PROCESS | 15389 | [#9] json-stringify-tinderbox Cycles:10 Average:68.50 Median:69.00 stddev:0.53 (0.8%) stddev-sans-first:0.53 01:20:58 INFO - PROCESS | 15389 | Values: 69.0 68.0 68.0 68.0 69.0 69.0 68.0 68.0 69.0 69.0 01:20:58 INFO - PROCESS | 15389 | 01:20:58 INFO - PROCESS | 15389 | [#10] stanford-crypto-aes Cycles:10 Average:85.00 Median:84.00 stddev:2.75 (3.3%) stddev-sans-first:2.89 01:20:58 INFO - PROCESS | 15389 | Values: 84.0 83.0 82.0 90.0 84.0 84.0 84.0 90.0 84.0 85.0 01:20:58 INFO - PROCESS | 15389 | 01:20:58 INFO - PROCESS | 15389 | [#11] stanford-crypto-ccm Cycles:10 Average:121.00 Median:120.50 stddev:5.37 (4.5%) stddev-sans-first:5.69 01:20:58 INFO - PROCESS | 15389 | Values: 120.0 115.0 115.0 131.0 126.0 121.0 118.0 127.0 120.0 117.0 01:20:58 INFO - PROCESS | 15389 | 01:20:58 INFO - PROCESS | 15389 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:144.20 Median:147.00 stddev:6.55 (4.5%) stddev-sans-first:5.81 01:20:58 INFO - PROCESS | 15389 | Values: 134.0 147.0 144.0 145.0 147.0 131.0 145.0 149.0 150.0 150.0 01:20:58 INFO - PROCESS | 15389 | 01:20:58 INFO - PROCESS | 15389 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.30 Median:67.50 stddev:0.95 (1.4%) stddev-sans-first:0.78 01:20:58 INFO - PROCESS | 15389 | Values: 69.0 68.0 66.0 67.0 67.0 68.0 68.0 67.0 67.0 66.0 01:20:58 INFO - PROCESS | 15389 | -------- Summary: end -------- 01:20:58 INFO - PROCESS | 15389 | 01:20:58 INFO - TEST-INFO | 15389: exit 0 01:20:58 INFO - TEST-OK | kraken | took 60643ms 01:20:58 INFO - TEST-START | v8_7 01:20:58 INFO - operating with platform_type : linux_ 01:20:58 INFO - Initialising browser for v8_7 test... 01:20:58 INFO - TEST-INFO | started process 15680 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpdYBbsS/profile http://localhost:57274/getInfo.html) 01:21:02 INFO - PROCESS | 15680 | 01:21:02 INFO - PROCESS | 15680 | (process:15754): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 01:21:03 INFO - PROCESS | 15680 | __metrics Screen width/height:1600/1200 01:21:03 INFO - PROCESS | 15680 | colorDepth:24 01:21:03 INFO - PROCESS | 15680 | Browser inner width/height: 1024/697 01:21:03 INFO - PROCESS | 15680 | __metrics 01:21:03 INFO - PROCESS | 15680 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 01:21:04 INFO - TEST-INFO | 15680: exit 0 01:21:04 INFO - Browser initialized. 01:21:04 INFO - Running cycle 1/1 for v8_7 test... 01:21:04 INFO - TEST-INFO | started process 15804 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpdYBbsS/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 01:21:06 INFO - PROCESS | 15804 | 01:21:06 INFO - PROCESS | 15804 | (process:15863): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 01:21:16 INFO - PROCESS | 15804 | RSS: Main: 150913024 01:21:16 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | Cycle 1(1): loaded http://localhost:57274/tests/v8_7/run.html (next: http://localhost:57274/tests/v8_7/run.html) 01:21:39 INFO - PROCESS | 15804 | RSS: Main: 147124224 01:21:39 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | __start_tp_report 01:21:39 INFO - PROCESS | 15804 | _x_x_mozilla_page_load 01:21:39 INFO - PROCESS | 15804 | _x_x_mozilla_page_load_details 01:21:39 INFO - PROCESS | 15804 | |i|pagename|runs| 01:21:39 INFO - PROCESS | 15804 | |0;Richards;165.12549537648613 01:21:39 INFO - PROCESS | 15804 | |1;DeltaBlue;188.46588767433096 01:21:39 INFO - PROCESS | 15804 | |2;Encrypt;279.9552071668533 01:21:39 INFO - PROCESS | 15804 | |3;Decrypt;5223.958333333333 01:21:39 INFO - PROCESS | 15804 | |4;RayTrace;1063.8297872340424 01:21:39 INFO - PROCESS | 15804 | |5;Earley;731.528895391368 01:21:39 INFO - PROCESS | 15804 | |6;Boyer;12395.061728395061 01:21:39 INFO - PROCESS | 15804 | |7;RegExp;41000 01:21:39 INFO - PROCESS | 15804 | |8;Splay;620.7535515750463 01:21:39 INFO - PROCESS | 15804 | |9;NavierStokes;4854.368932038835 01:21:39 INFO - PROCESS | 15804 | __end_tp_report 01:21:39 INFO - PROCESS | 15804 | __startTimestamp1452763299392__endTimestamp 01:21:39 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | ------- Summary: start ------- 01:21:39 INFO - PROCESS | 15804 | Number of tests: 10 01:21:39 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | [#0] Richards Cycles:1 Average:165.13 Median:165.13 stddev:0.00 (0.0%) 01:21:39 INFO - PROCESS | 15804 | Values: 165.1 01:21:39 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | [#1] DeltaBlue Cycles:1 Average:188.47 Median:188.47 stddev:0.00 (0.0%) 01:21:39 INFO - PROCESS | 15804 | Values: 188.5 01:21:39 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | [#2] Encrypt Cycles:1 Average:279.96 Median:279.96 stddev:0.00 (0.0%) 01:21:39 INFO - PROCESS | 15804 | Values: 280.0 01:21:39 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | [#3] Decrypt Cycles:1 Average:5223.96 Median:5223.96 stddev:0.00 (0.0%) 01:21:39 INFO - PROCESS | 15804 | Values: 5224.0 01:21:39 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | [#4] RayTrace Cycles:1 Average:1063.83 Median:1063.83 stddev:0.00 (0.0%) 01:21:39 INFO - PROCESS | 15804 | Values: 1063.8 01:21:39 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | [#5] Earley Cycles:1 Average:731.53 Median:731.53 stddev:0.00 (0.0%) 01:21:39 INFO - PROCESS | 15804 | Values: 731.5 01:21:39 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | [#6] Boyer Cycles:1 Average:12395.06 Median:12395.06 stddev:0.00 (0.0%) 01:21:39 INFO - PROCESS | 15804 | Values: 12395.1 01:21:39 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | [#7] RegExp Cycles:1 Average:41000.00 Median:41000.00 stddev:0.00 (0.0%) 01:21:39 INFO - PROCESS | 15804 | Values: 41000.0 01:21:39 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | [#8] Splay Cycles:1 Average:620.75 Median:620.75 stddev:0.00 (0.0%) 01:21:39 INFO - PROCESS | 15804 | Values: 620.8 01:21:39 INFO - PROCESS | 15804 | 01:21:39 INFO - PROCESS | 15804 | [#9] NavierStokes Cycles:1 Average:4854.37 Median:4854.37 stddev:0.00 (0.0%) 01:21:39 INFO - PROCESS | 15804 | Values: 4854.4 01:21:39 INFO - PROCESS | 15804 | -------- Summary: end -------- 01:21:39 INFO - PROCESS | 15804 | 01:21:40 INFO - TEST-INFO | 15804: exit 0 01:21:40 INFO - TEST-OK | v8_7 | took 41410ms 01:21:40 INFO - SUITE-END | took 1212s 01:21:40 INFO - Completed test suite (00:20:12) 01:21:40 INFO - Working with test: dromaeo_css 01:21:40 INFO - Generating results file: dromaeo_css 01:21:40 INFO - Working with test: kraken 01:21:40 INFO - Generating results file: kraken 01:21:40 INFO - javascript benchmark 01:21:40 INFO - Working with test: v8_7 01:21:40 INFO - Generating results file: v8_7 01:21:40 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:21:40 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,64,43]] 01:21:40 INFO - process_Request line: dromaeo_css 6862.61 graph.html#tests=[[72,64,43]] 01:21:40 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:21:40 INFO - process_Request line: kraken 1515.10 graph.html#tests=[[232,64,43]] 01:21:40 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:21:40 INFO - process_Request line: v8_7 20261.41 graph.html#tests=[[230,64,43]] 01:21:40 INFO - RETURN: dromaeo_css: 6862.61 01:21:40 INFO - RETURN: kraken: 1515.10 01:21:40 INFO - RETURN: v8_7: 20261.41 01:21:40 INFO - javascript benchmark 01:21:40 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3193.2336239302567, 3208.6310074341445, 3255.153660048387, 3256.0720194744504, 3256.7068963793254, 5168.379794424665, 5214.478552144784, 5240.37115546134, 5268.525832675058, 5269.973650131748, 5216.7391630418515, 5243.895122097556, 5249.947500524993, 5310.123829568117, 5325.893482130355, 4814.975925120379, 4881.951180488203, 4915.041566894457, 4927.50724927508, 4970.701757894538, 4772.04559088182, 4852.611791056707, 4880.829170979016, 4918.606511479073, 4976.427710813248, 4710.128626204163, 4821.7830197641015, 4826.058918510892, 4828.46886842447, 4916.360873086512, 4755.476897541268, 4836.951630483685, 4837.274408838667, 4848.7090774553635, 4853.781579828917, 4806.375171227753, 4807.230843065093, 4814.1334559779225, 4817.421909370898, 4819.228923372244, 5038.899222015539, 5113.463086375914, 5145.716985565792, 5154.304168937183, 5193.740312984336, 5600.27196464457, 5629.60592758507, 5639.971800140973, 5642.858928526779, 5647.0, 5663.037283661746, 5665.461781130786, 5665.830025099253, 5673.404292549264, 5678.0, 5289.894202115936, 5303.390110137345, 5355.946440535545, 5360.731963401814, 5369.8389048329, 5762.538996880324, 5765.798197063166, 5806.1581070744505, 5812.38969908162, 5872.941270587325, 5606.747696353674, 5610.887782244332, 5616.0, 5616.971915140398, 5629.296337957755, 5502.8349149525575, 5507.311586051744, 5610.046292130348, 5648.830535083954, 5677.858053548694, 5522.199281104217, 5578.776848925998, 5589.161625756169, 5592.720363981784, 5659.6321239119325, 5582.553395728332, 5589.664620122806, 5591.4688104629995, 5599.776008959678, 5607.719614019365, 4170.35359519275, 4254.085371645049, 4260.446142001582, 4272.957270427318, 4293.656507479394, 3843.788591627487, 3846.7114966377076, 3876.205377897524, 3889.844406223776, 3925.666318362914, 5417.674939503642, 5430.429804870431, 5431.945680543223, 5432.266644003088, 5481.424450432727, 5538.501534861882, 5613.438656134354, 5640.294963129609, 5693.17448969897, 5765.106408506688, 5287.101192797157, 5311.946880531223, 5318.388385335658, 5322.733863306897, 5331.760070796823, 4847.933454639973, 4852.296417019583, 4853.223484242575, 4863.10032643962, 4908.3619129513645, 5760.452756988079, 5829.0, 5946.643201407929, 5987.461128498456, 6027.939720602825, 5559.27729395176, 5567.276254086943, 5568.470995255444, 5591.21722958778, 5591.8881622368135, 5764.279465066867, 5809.738561764815, 5827.912581311199, 5830.9416905832095, 5839.8540036497725, 5518.917216241679, 5578.442155784389, 5690.943090569207, 5717.485426311652, 5736.397678243724, 5610.382857885547, 5647.29408823897, 5653.915191272216, 5654.434556544313, 5666.9716651416475, 5417.160340147283, 5493.340799104133, 5512.200730893917, 5527.917081243704, 5528.695921724183, 5480.095784195563, 5482.890342193214, 5508.063629182969, 5511.283533140666, 5515.034868898007, 5411.377691565521, 5431.293931788842, 5435.0, 5451.345838499246, 5453.0, 5506.284183056177, 5532.640378375393, 5589.720513974366, 5600.69196194197, 5610.49505544503, 5362.195670649434, 5407.351117865881, 5408.161734931092, 5425.050616142238, 5427.375851777097], "unit": "score", "name": "dojo.html", "value": 5216.114042211204}, {"lowerIsBetter": false, "replicates": [528.5269683633148, 532.3691425660593, 556.702164342077, 557.7979454276034, 574.0012378461478, 35350.2929941401, 35600.2879942401, 35750.284994300164, 35805.82097089514, 35832.0, 35998.640013599856, 36453.817730911374, 36675.63324366756, 36697.633023669754, 36928.63071369285, 8186.631601577928, 8239.464434811747, 8315.542645154514, 8341.290990265805, 8367.28878045367, 8017.478863873829, 8380.329573634095, 8390.580470976458, 8392.412531122824, 8404.0, 8345.54099524526, 8447.070822209553, 8455.154484551556, 8473.95763021184, 8477.321814254876, 8365.372597055215, 8395.496270223806, 8423.36824738144, 8430.662773489054, 8455.873161902577, 8260.917390826075, 8344.249017588385, 8355.331573474108, 8384.622691978875, 8410.621522031463, 34968.475472867925, 35258.47112293317, 35666.465003024976, 35713.46429803555, 35792.46311305332, 2974.2118338640275, 3218.4850423932294, 3248.220427097503, 3305.471124620073, 3346.4143774839304, 29402.117936461942, 29911.850440747876, 30306.242343941358, 30772.2306942326, 31317.530237046463, 3251.0734440684528, 3759.191773768653, 3791.473924260341, 3846.6345697158727, 3878.806059697004, 213931.0, 215793.0, 216643.0, 216819.0, 216990.91504542535, 55027.44972550304, 55749.0, 56356.718216408655, 60041.0, 61204.0, 54080.459195407544, 54499.727501363035, 54576.72711636496, 54612.453875461535, 54742.0, 13487.527936522174, 13786.310684465736, 14042.789358159636, 14074.929625351808, 14095.295235238196, 9816.214702823758, 9953.651622193189, 9979.251556133318, 10055.195584353234, 10056.34633748804, 20031.599368012558, 20156.798432015494, 20276.695849562268, 20361.49096272605, 20456.079476423598, 7981.201879812089, 8181.118342781075, 8209.302209312274, 8224.874547671847, 8309.542975136304, 891.6299735609649, 987.8370068938544, 988.2341185581232, 992.4987881120132, 1122.921395502307, 27461.588076178872, 29896.40207195844, 30975.69024309728, 31037.224069397995, 31248.375032499676, 1026.5534492495788, 1042.8435734639866, 1054.7679510507676, 1064.627380416848, 1120.6357933671588, 13557.0, 13570.728585428236, 16234.837651623333, 16328.75506867398, 16438.589035273973, 385412.0, 387350.0, 387375.0, 390733.0, 391049.0, 53823.73088134534, 53833.46166538363, 54196.187057194176, 54337.0, 54546.727266363414, 1319.3864852843474, 1366.501227052099, 1370.3353873371407, 1372.3687103932104, 1376.4356613788298, 28158.85920570466, 29255.707442925297, 29442.558361625022, 29550.0, 29608.40783184281, 44035.0, 44078.779606101765, 44553.777231113636, 44614.3307850376, 44699.77650111729, 304520.0, 305407.0, 306331.0, 306398.0, 306709.0, 31409.68590314159, 42354.364684530374, 42787.0, 42791.572084278756, 42809.57190428056, 44466.55533444624, 45054.0, 45430.77284613556, 45520.77239613781, 45873.31190032219, 34679.65320346865, 35841.134326867665, 35878.28243435064, 36021.0, 36201.0, 35891.64108358883, 36263.27473450464, 36509.817450912575, 36708.0, 36770.632293677794, 35440.29119417649, 37300.253994920495, 37438.0, 37500.43749343816, 37908.241835163695, 28268.55123674928, 31598.684013159575, 31990.36019279648, 32067.518987215677, 32274.677253228107, 24370.390740231636, 24410.145644902343, 24717.629235561122, 24833.385829920997, 25012.62481062749], "unit": "score", "name": "ext.html", "value": 18179.646517148005}, {"lowerIsBetter": false, "replicates": [363.6363636363636, 365.05268827392905, 365.0872817955112, 366.61505419309725, 367.1482161385585, 15610.375584976602, 16625.750613740773, 16680.83319166808, 17346.132693365314, 17713.291468341282, 15821.683566328666, 16079.11564863932, 16264.0, 16298.429554965578, 16521.586960325996, 4659.254519276917, 4841.588464980481, 4858.368412106422, 4867.464578896319, 4867.586255168315, 4775.832845850396, 4857.222844344906, 4860.878478038042, 5087.389513258414, 5311.336082989626, 5054.292399064134, 5257.211418287249, 5265.947340526584, 5300.761465734032, 5327.360716713981, 5173.896522069537, 5199.896002079956, 5224.895502089956, 5243.764030618631, 5395.271638328814, 5202.791888324463, 5215.400228973641, 5219.347581552306, 5234.947650523484, 5240.816571419982, 13222.603321900358, 19059.42821715351, 19654.410367688994, 19656.312029079058, 19786.20855165806, 1939.9127039283267, 1962.8429725621916, 1976.802319768026, 2042.018652766962, 2209.304069218207, 8463.322934165251, 9037.774055648595, 9056.637734490612, 9262.351635385527, 10399.428031458267, 1755.806861245262, 1783.580858498252, 1800.558863078541, 1804.1159831682512, 1818.7453756473972, 53231.73384133055, 54857.45142548563, 55040.72479637616, 55942.72028639871, 56829.43170568283, 10099.848502272473, 10217.386956782468, 10221.9488902555, 10246.846297305547, 10280.794384112276, 13374.799378009338, 13390.397432115578, 13418.932905335607, 13546.05177637556, 13547.86452135466, 6917.79246622592, 6921.688524016431, 6941.132358455193, 6984.057152284377, 7053.365197132282, 6410.551261411656, 6416.326285740023, 6444.548881578245, 6449.258335291408, 6480.222373315232, 4411.139827733561, 4504.887377815581, 4517.141743068806, 4522.977385113053, 4551.704139230939, 1782.875198736102, 1881.698928171486, 1920.4238728381429, 1926.1428664244556, 1961.0782932021928, 927.420362273579, 934.5233930695395, 971.5385192033727, 983.4935008470643, 999.2505620784411, 15342.386304547916, 15777.526674199793, 15978.0, 16301.266443010092, 16370.099644519427, 867.0549101479291, 871.6731225790329, 875.3916028360355, 924.861270809384, 928.3733479901175, 9341.953290233505, 9500.857487137699, 9565.947745747962, 9604.471754053455, 9807.26445516589, 387431.0, 390806.0, 390817.0, 395027.0, 459825.0, 46296.7685161572, 59989.40010599925, 65159.34840651628, 72210.63894680493, 72841.27158728451, 1073.6939972107912, 1082.3722241100143, 1084.8643919510062, 1098.373926861697, 1101.7686285879895, 14626.414943402146, 14743.336549855498, 14820.481283155037, 14880.85119148838, 15029.098254104789, 31073.53389699111, 31149.377012460078, 31158.065258042294, 31585.8420707895, 31993.68006319907, 42071.36892946547, 42418.0, 42664.78667606766, 42954.78522607367, 44811.55188448074, 6997.230304666585, 7024.578525288499, 7133.144022717307, 7160.713571457083, 7213.1704853942465, 10176.949115254376, 10382.169426446017, 10573.418461984666, 10858.2399232053, 11250.606228781953, 9185.494797786187, 9295.488748118647, 9393.0, 9496.14534691881, 9662.516874156405, 9184.622306654055, 9389.953050234704, 9645.42127472354, 9647.372920760128, 9871.605135794487, 9158.496282704515, 9274.814503710022, 9436.386634868712, 9649.276304277068, 9822.165115965223, 7050.0, 7265.709371625076, 7329.193788683134, 7495.325420712162, 7590.240975902366, 9025.458472491671, 9053.419775364253, 9067.727968160965, 9569.61721531131, 9629.32594718363], "unit": "score", "name": "jquery.html", "value": 7889.580816871883}, {"lowerIsBetter": false, "replicates": [1486.5094518808792, 1498.8351281359048, 1685.8314168583142, 1802.97295540567, 1814.7187185986168, 7864.292213700765, 7864.4101692373015, 7883.881741773878, 8056.1943805619485, 8090.635921383538, 7965.641546130423, 7982.680692772282, 7987.361011119111, 8046.678132874678, 8068.91931080689, 2325.686032385623, 2355.8586484810967, 2368.2895131460577, 2374.1809075868796, 2377.393764590036, 2358.3986083548757, 2388.95222095558, 2393.3298676370646, 2398.436367453647, 2407.554602398553, 2297.529006553661, 2335.567919934809, 2349.4713689419827, 2368.017272831773, 2368.2539999900064, 2369.9052037918464, 2399.6280576510667, 2410.240774156135, 2419.794317483016, 2425.151197081025, 2370.573296806574, 2373.679553260305, 2374.726906405768, 2379.7144342678816, 2401.7598240176017, 7910.920890791133, 7972.760817175494, 7997.400194985399, 8000.119971806621, 8016.799580010488, 4900.901981960376, 5049.863780649362, 5077.49225077493, 5081.720505372203, 5096.05722941257, 3039.574459575661, 3080.537919312121, 3112.175273552488, 3114.174743692923, 3129.436701393748, 1028.4189432970422, 1039.111559616532, 1077.3589714120087, 1094.042712626452, 1103.4979084516526, 11051.0, 11155.330680159297, 11182.944085279603, 11193.216474846764, 11200.607978720787, 4270.188664153801, 4374.103308821684, 4411.2721400968485, 4419.624331931822, 4530.478994915561, 9108.681196158102, 9132.589033493508, 9137.269018478506, 9153.17621414076, 9162.81674366509, 4733.077049975291, 4745.810167593327, 4791.137595232892, 4810.687305325143, 4812.302216178705, 4316.568343165721, 4331.870043898688, 4334.891627709269, 4341.696081274281, 4346.956530434655, 3516.9624960636675, 3551.5027896094566, 3560.590532088791, 3566.1262990567475, 3602.243528858969, 1109.2013750099916, 1112.3826276416505, 1118.692359601116, 1126.4536699700639, 1154.3074155506629, 1259.1563652352945, 1270.9237445753283, 1294.8769866862633, 1303.2636560343565, 1313.2317594207495, 7195.712171513185, 7210.423166146696, 7245.094363204599, 7259.310365515267, 7275.308845659654, 1125.4372813593204, 1143.0969534067992, 1155.1625071822862, 1155.2086820527966, 1164.1036401970434, 5394.514493695587, 5485.396606373296, 5516.14499752539, 5550.861228469321, 5554.50009499147, 9516.571754271074, 9519.762005949906, 9910.80178396428, 9943.80112397748, 9957.0, 9631.71104866855, 9656.179224765832, 9714.271429642806, 9716.271279653913, 9727.221822254203, 7509.211532789088, 7523.623818809037, 7559.1306999695735, 7626.6186690665245, 7654.387648988068, 7054.224035356004, 7074.0, 7083.929160708327, 7113.0753002109395, 7113.964430177816, 8494.787630309293, 8610.569471526524, 8717.607707653044, 8808.163224493663, 8838.204561589488, 8864.86702699447, 8976.640934362813, 8991.595378207865, 9009.639614415612, 9066.727998160066, 6725.361090696376, 6731.932680673326, 6837.384635382839, 6840.794776156723, 6846.041554182518, 7657.272559106876, 7758.340541054074, 7820.960895195488, 7855.646495907584, 7860.921390786248, 6985.1617805863625, 7129.500934934505, 7415.666295016845, 7489.513181643176, 7614.847703045797, 7018.75434359795, 7073.151221853411, 7117.8932316016335, 7127.322904324081, 7176.856462870818, 6947.096877405905, 7035.753748618774, 7061.2585678505075, 7064.222935477196, 7126.35862772353, 6267.2479302484, 6306.0, 6311.337309582428, 6316.842078948063, 6317.5893566918, 6328.968355158195, 6475.967620161869, 6489.253735820253, 6499.025146228104, 6500.642464664489], "unit": "score", "name": "mootools.html", "value": 4601.588340530334}, {"lowerIsBetter": false, "replicates": [345.0528299817002, 350.4043126684635, 354.38337293109964, 355.30183190031585, 355.75630692975307, 6187.0719392091205, 6233.563650544464, 6234.750609975601, 6248.125262463253, 6417.775377861776, 6178.598391104575, 6188.257409110902, 6193.318734939165, 6203.937960620404, 6213.254409470858, 4780.880477988043, 4782.880427989293, 4788.090262850047, 4795.040991801636, 4807.903841923159, 4803.2795080738, 4808.591269742059, 4810.97594512027, 4812.181929072049, 4816.903661926759, 4666.090112428078, 4740.90518189636, 4761.50004249554, 4774.68964517307, 4774.785134668949, 4725.740084295362, 4728.361671174382, 4749.833755818529, 4757.262624293223, 4773.331733557287, 4109.0959988802415, 4131.256373852705, 4146.91706165878, 4150.481189851269, 4164.75011499311, 5902.970485147547, 5942.64344139353, 5955.136505206764, 5962.5528085393335, 5975.223220981288, 5384.300040994645, 5487.75305111271, 5533.501984821385, 5538.778448862041, 5547.195656629807, 6578.539502234846, 6578.736850525973, 6580.14458120446, 6582.210134783809, 6584.374484423972, 4583.564561366665, 4586.1744885920525, 4588.701734387254, 4598.126355992351, 4615.353850460938, 6604.811133995879, 6768.93231067688, 6830.282820303896, 6851.48613853963, 6863.416609588191, 4619.653525985497, 4622.168009758276, 4625.629949604024, 4661.673682842168, 4669.579737823544, 4714.175019371596, 4720.291956206596, 4720.480747117815, 4724.763761811896, 4729.196036673774, 5454.509094181542, 5460.590455715757, 5463.726813659301, 5465.890682186414, 5468.207109969032, 6391.201099862517, 6551.344865513506, 6579.736810527621, 6594.901076483857, 6594.967025164843, 1630.8124565674862, 1650.818409974902, 1675.9748603770954, 1684.4693921414714, 1686.7385555238957, 1099.2964502718266, 1102.2504696806088, 1105.8783533811275, 1113.1150735165563, 1121.8373335866254, 6198.876022479525, 6213.130161777355, 6215.254169499599, 6219.222597175353, 6246.6876656167005, 6628.171478565179, 6659.833504162435, 6677.599344039373, 6692.899606505906, 6716.5634233774645, 6099.054646529795, 6207.068939659087, 6209.565330426827, 6224.221972253468, 6226.501879849601, 3633.182533929845, 3646.124930016777, 3652.7990960497427, 3660.194757153422, 3661.9816900915857, 7063.293670632998, 7077.858442831114, 7077.929220707727, 7090.397316228075, 7093.361597456254, 6652.634105124168, 6847.554908930903, 6857.897131543031, 6858.931410685929, 6869.072675188885, 6994.93005069953, 7007.789766307019, 7037.22590515043, 7048.189458212371, 7054.6472676365975, 6653.068570400244, 6685.498587606046, 6693.497987651043, 6694.698738556679, 6698.39714425704, 6473.468571999525, 6548.901766473602, 6572.967135164294, 6603.603783772989, 6616.2722100567935, 6940.0, 7009.1589009319205, 7010.26392228829, 7020.859582808417, 7037.824054398681, 4625.352450656844, 4638.373819534319, 4640.3735495709, 4676.649251306234, 4697.553732395417, 6711.0940023096255, 6715.127033485615, 6721.764738234138, 6733.663316834237, 6864.2106157790495, 6586.50601204902, 6605.900911486236, 6637.834054148685, 6641.169853768279, 6643.800685979429, 6566.6388348641285, 6590.80227593173, 6593.967030164818, 6596.043573681885, 6620.040094186413, 6322.8735425290315, 6466.32103629131, 6482.870342593027, 6487.448566871869, 6493.026046092935, 6624.8012559623285, 6634.535582509178, 6654.767083152066, 6659.267480577229, 6664.200295964515, 6476.06097115925, 6482.935170648233, 6500.317466666121, 6513.250976137805, 6538.280789113289], "unit": "score", "name": "prototype.html", "value": 4957.3565416671745}, {"lowerIsBetter": false, "replicates": [733.5268751655183, 779.9103103143136, 780.8204113053997, 820.085604550926, 840.9032961209463, 12804.871951280484, 12971.221726696393, 13079.476820927164, 13112.868871311284, 13115.934420327909, 12628.81056784149, 12659.30373829439, 12660.746785064317, 12679.302638354888, 12733.236005839655, 798.3413683710933, 799.0371602219341, 815.4088285992667, 818.8116733151379, 822.5023860564362, 810.4610434061372, 814.6904176412985, 822.3051521464353, 822.6462621072936, 825.8719898415756, 851.2679095977485, 853.5007020892754, 854.4104567848196, 859.179483593167, 861.0227391910196, 841.8526757817388, 842.8019415437367, 848.6817443458702, 849.8130411309502, 851.3487182305541, 628.7547856336032, 630.6310808177221, 631.8167731357946, 632.0140580694132, 634.3688030409771, 13255.337233138402, 13602.183868967893, 13610.251436171007, 13642.454301827915, 13717.108387954751, 12501.687457813536, 12521.248725076433, 12612.0, 12795.360909484876, 12881.420336084899, 10625.574977000988, 10677.679669609925, 10740.570377184982, 10749.78500429987, 10770.515326810313, 3563.7861728296384, 3591.856325746967, 3635.8909232723063, 3722.40441529354, 3731.533558305212, 45849.0, 45852.3122153168, 45993.5400645996, 46356.76821615904, 46482.302765458546, 9662.178714809179, 9710.95144524287, 9730.562124704406, 9772.21822254218, 9792.51037448139, 16582.17089145538, 16608.418705345255, 16627.0, 16663.583410414838, 17536.0, 7524.623768811538, 7626.504277221963, 7683.385329173652, 7746.535207887545, 7789.766307010798, 4217.219814334358, 4254.234237837219, 4254.489461264668, 4304.053108316165, 4320.4167437395545, 3147.889823856154, 3155.2742869140225, 3179.0, 3184.2835362043356, 3191.920201994969, 572.3303734630492, 577.7515668262604, 585.7920438244362, 586.1354502109355, 605.1558076483282, 489.9142650036229, 529.7324850950323, 554.3929397309939, 595.6336852835475, 606.1483615520201, 8128.75613731589, 8267.586620669063, 8332.125126861714, 8427.241548260687, 8624.051354351017, 458.660591162544, 487.6026038778384, 561.2339157050596, 631.2677294338545, 645.8407159149244, 3929.44987701722, 3972.980135099364, 3993.5407428146136, 4005.998500374906, 4141.006158521933, 53481.465185348425, 54213.728931355094, 54342.72828635832, 54609.180862287096, 55472.445275547536, 46566.76716616463, 46723.766381168556, 46845.76577117161, 47120.7643961778, 47136.52863471321, 43736.0, 44654.0, 44891.55108448939, 45016.3247551287, 46926.0, 8303.211194936472, 8361.289290410383, 8435.91564084376, 8502.813174327086, 8740.562971851255, 33805.0, 33913.49129763006, 34038.0, 34081.65918340884, 34729.47905781466, 38220.80889595534, 42851.357229642206, 42885.785571071945, 42893.0, 42926.570734292254, 9825.705228843146, 10015.399076055168, 10220.0, 10659.8934010662, 10693.679189624323, 11079.897956144927, 11248.931351521593, 11754.412279385826, 12011.75976480483, 12072.094592905743, 10671.733206669895, 10758.677239682822, 10771.784564308513, 10835.458227088457, 11362.488688008894, 10926.890731092588, 10965.671029869116, 11254.268472549586, 11294.548218071184, 11351.886481135083, 10132.645357412455, 10142.847857281999, 10386.740331491774, 10504.894951050392, 10632.202584806326, 8879.733607991771, 8947.239484643878, 9040.141186587263, 9153.084691530794, 9294.907050929674, 8050.27547520726, 8358.791030224049, 8597.0, 8994.235489983163, 9333.439993600134], "unit": "score", "name": "yui.html", "value": 6120.062440003106}], "name": "dromaeo_css", "value": 6862.609290676132}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 105.0, 113.0, 112.0, 110.0, 123.0, 113.0, 111.0, 112.0, 111.0], "unit": "score", "name": "ai-astar", "value": 112.0}, {"lowerIsBetter": true, "replicates": [155.0, 125.0, 147.0, 170.0, 127.0, 153.0, 154.0, 129.0, 160.0, 124.0], "unit": "score", "name": "audio-beat-detection", "value": 144.4}, {"lowerIsBetter": true, "replicates": [162.0, 165.0, 164.0, 164.0, 168.0, 165.0, 166.0, 173.0, 168.0, 166.0], "unit": "score", "name": "audio-dft", "value": 166.1}, {"lowerIsBetter": true, "replicates": [73.0, 75.0, 72.0, 72.0, 72.0, 74.0, 151.0, 76.0, 76.0, 75.0], "unit": "score", "name": "audio-fft", "value": 81.6}, {"lowerIsBetter": true, "replicates": [96.0, 98.0, 143.0, 96.0, 96.0, 96.0, 145.0, 96.0, 96.0, 154.0], "unit": "score", "name": "audio-oscillator", "value": 111.6}, {"lowerIsBetter": true, "replicates": [109.0, 110.0, 110.0, 110.0, 110.0, 110.0, 110.0, 110.0, 110.0, 110.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.9}, {"lowerIsBetter": true, "replicates": [147.0, 148.0, 146.0, 147.0, 146.0, 147.0, 149.0, 147.0, 148.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 147.2}, {"lowerIsBetter": true, "replicates": [97.0, 97.0, 96.0, 96.0, 97.0, 97.0, 97.0, 97.0, 98.0, 97.0], "unit": "score", "name": "imaging-desaturate", "value": 96.9}, {"lowerIsBetter": true, "replicates": [62.0, 60.0, 59.0, 61.0, 58.0, 59.0, 58.0, 62.0, 56.0, 59.0], "unit": "score", "name": "json-parse-financial", "value": 59.4}, {"lowerIsBetter": true, "replicates": [69.0, 68.0, 68.0, 68.0, 69.0, 69.0, 68.0, 68.0, 69.0, 69.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.5}, {"lowerIsBetter": true, "replicates": [84.0, 83.0, 82.0, 90.0, 84.0, 84.0, 84.0, 90.0, 84.0, 85.0], "unit": "score", "name": "stanford-crypto-aes", "value": 85.0}, {"lowerIsBetter": true, "replicates": [120.0, 115.0, 115.0, 131.0, 126.0, 121.0, 118.0, 127.0, 120.0, 117.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 121.0}, {"lowerIsBetter": true, "replicates": [134.0, 147.0, 144.0, 145.0, 147.0, 131.0, 145.0, 149.0, 150.0, 150.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 144.2}, {"lowerIsBetter": true, "replicates": [69.0, 68.0, 66.0, 67.0, 67.0, 68.0, 68.0, 67.0, 67.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 67.3}], "name": "kraken", "value": 1515.1}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [165.12549537648613], "unit": "score", "name": "Richards", "value": 213.78891199999993}, {"lowerIsBetter": false, "replicates": [188.46588767433096], "unit": "score", "name": "DeltaBlue", "value": 350.8221079999999}, {"lowerIsBetter": false, "replicates": [279.9552071668533], "unit": "score", "name": "Encrypt", "value": 950.7985320000004}, {"lowerIsBetter": false, "replicates": [5223.958333333333], "unit": "score", "name": "Decrypt", "value": 50.95389032901295}, {"lowerIsBetter": false, "replicates": [1063.8297872340424], "unit": "score", "name": "RayTrace", "value": 695.5896600000003}, {"lowerIsBetter": false, "replicates": [731.528895391368], "unit": "score", "name": "Earley", "value": 911.0549209999997}, {"lowerIsBetter": false, "replicates": [12395.061728395061], "unit": "score", "name": "Boyer", "value": 53.768429282868496}, {"lowerIsBetter": false, "replicates": [41000.0], "unit": "score", "name": "RegExp", "value": 22.219146341463418}, {"lowerIsBetter": false, "replicates": [620.7535515750463], "unit": "score", "name": "Splay", "value": 131.27754129353232}, {"lowerIsBetter": false, "replicates": [4854.368932038835], "unit": "score", "name": "NavierStokes", "value": 305.7040000000001}], "name": "v8_7", "value": 20261.40860008172}]} 01:21:40 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,43]]", "result": "20261.41"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,43]]", "result": "1515.10"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,43]]", "result": "6862.61"}}} 01:21:40 INFO - Return code: 0 01:21:40 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 01:21:40 INFO - # TBPL SUCCESS # 01:21:40 INFO - Running post-action listener: _resource_record_post_action 01:21:40 INFO - Running post-run listener: _resource_record_post_run 01:21:41 INFO - Total resource usage - Wall time: 1230s; CPU: 13.0%; Read bytes: 0; Write bytes: 550596608; Read time: 0; Write time: 415220 01:21:41 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 184668160; Read time: 0; Write time: 187056 01:21:41 INFO - run-tests - Wall time: 1215s; CPU: 13.0%; Read bytes: 0; Write bytes: 311169024; Read time: 0; Write time: 198584 01:21:41 INFO - Running post-run listener: _upload_blobber_files 01:21:41 INFO - Blob upload gear active. 01:21:41 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 01:21:41 INFO - Files from /builds/slave/test-pgo/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 01:21:41 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', 'Fx-Team', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 01:21:41 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 Fx-Team -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 01:21:42 INFO - (blobuploader) - INFO - Open directory for files ... 01:21:42 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 01:21:42 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 01:21:42 INFO - (blobuploader) - INFO - Uploading, attempt #1. 01:21:44 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 01:21:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 01:21:44 INFO - (blobuploader) - INFO - Done attempting. 01:21:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 01:21:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 01:21:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 01:21:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 01:21:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 01:21:45 INFO - (blobuploader) - INFO - Done attempting. 01:21:45 INFO - (blobuploader) - INFO - Iteration through files over. 01:21:45 INFO - Return code: 0 01:21:45 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 01:21:45 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 01:21:45 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/032aa1b119fe9d55bc740cf6ebbe8fe25302db52501e38126c2f2297efb71c4d83e2ee1d86ce16c963519a0e8ed245959f51effd80d86e8606cc8045ee4af4c1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/6bed8f0e37f2f98218cc58fecd9602a8c8f5feed9e1b56639b232098db23b860967e23cc699fb6af82db1dee71a566e18d4c603a0fb3188939134c6112d5a086"} 01:21:45 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 01:21:45 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 01:21:45 INFO - Contents: 01:21:45 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/032aa1b119fe9d55bc740cf6ebbe8fe25302db52501e38126c2f2297efb71c4d83e2ee1d86ce16c963519a0e8ed245959f51effd80d86e8606cc8045ee4af4c1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/6bed8f0e37f2f98218cc58fecd9602a8c8f5feed9e1b56639b232098db23b860967e23cc699fb6af82db1dee71a566e18d4c603a0fb3188939134c6112d5a086"} 01:21:45 INFO - Copying logs to upload dir... 01:21:45 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1279.075401 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 19 secs) (at 2016-01-14 01:21:44.989465) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-14 01:21:44.993495) ========= 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=eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/032aa1b119fe9d55bc740cf6ebbe8fe25302db52501e38126c2f2297efb71c4d83e2ee1d86ce16c963519a0e8ed245959f51effd80d86e8606cc8045ee4af4c1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/6bed8f0e37f2f98218cc58fecd9602a8c8f5feed9e1b56639b232098db23b860967e23cc699fb6af82db1dee71a566e18d4c603a0fb3188939134c6112d5a086"} build_url:https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011132 build_url: 'https://queue.taskcluster.net/v1/task/EYpUZtQ5QUaaKTlejgMxnQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/032aa1b119fe9d55bc740cf6ebbe8fe25302db52501e38126c2f2297efb71c4d83e2ee1d86ce16c963519a0e8ed245959f51effd80d86e8606cc8045ee4af4c1", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/6bed8f0e37f2f98218cc58fecd9602a8c8f5feed9e1b56639b232098db23b860967e23cc699fb6af82db1dee71a566e18d4c603a0fb3188939134c6112d5a086"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-14 01:21:45.017685) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 01:21:45.017992) ========= 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=eca2ab57546de7b41f256b19000001ef-1452761181.184534-1177801476 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004637 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 01:21:45.103689) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-14 01:21:45.104239) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-14 01:21:45.104711) ========= ========= Total master_lag: 0.23 =========