builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-055 starttime: 1453642632.57 results: success (0) buildid: 20160124030209 builduid: 6bd0f170d093450ab0c4cc19ba0509d9 revision: d6d81655dd9e146c300a64c0fcaeb04ca3300a19 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:12.567449) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:12.567983) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:12.568624) ========= 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=82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006335 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.05 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:12.629541) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:12.629882) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:12.746939) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:12.747254) ========= 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=82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004603 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:12.811370) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:12.811705) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:12.812106) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:12.812441) ========= 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=82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-24 05:37:13-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 223M=0s 2016-01-24 05:37:13 (223 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.177173 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:13.002817) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:13.003198) ========= 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=82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017308 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:13.065194) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:13.065577) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev d6d81655dd9e146c300a64c0fcaeb04ca3300a19 --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev d6d81655dd9e146c300a64c0fcaeb04ca3300a19 --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=82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-24 05:37:14,101 truncating revision to first 12 chars 2016-01-24 05:37:14,101 Setting DEBUG logging. 2016-01-24 05:37:14,101 attempt 1/10 2016-01-24 05:37:14,101 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/d6d81655dd9e?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-24 05:37:14,361 unpacking tar archive at: mozilla-central-d6d81655dd9e/testing/mozharness/ program finished with exit code 0 elapsedTime=0.562753 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:13.644229) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:13.644585) ========= echo d6d81655dd9e146c300a64c0fcaeb04ca3300a19 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'd6d81655dd9e146c300a64c0fcaeb04ca3300a19'] 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=82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False d6d81655dd9e146c300a64c0fcaeb04ca3300a19 program finished with exit code 0 elapsedTime=0.004451 script_repo_revision: 'd6d81655dd9e146c300a64c0fcaeb04ca3300a19' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:13.696228) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:13.696576) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-24 05:37:13.709795) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2016-01-24 05:37:13.710157) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:37:14 INFO - MultiFileLogger online at 20160124 05:37:14 in /builds/slave/test-pgo 05:37:14 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 05:37:14 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 05:37:14 INFO - {'append_to_log': False, 05:37:14 INFO - 'base_work_dir': '/builds/slave/test-pgo', 05:37:14 INFO - 'blob_upload_branch': 'Firefox', 05:37:14 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 05:37:14 INFO - 'branch': 'Firefox', 05:37:14 INFO - 'buildbot_json_path': 'buildprops.json', 05:37:14 INFO - 'config_files': ('talos/linux_config.py',), 05:37:14 INFO - 'default_actions': ('clobber', 05:37:14 INFO - 'read-buildbot-config', 05:37:14 INFO - 'download-and-extract', 05:37:14 INFO - 'populate-webroot', 05:37:14 INFO - 'create-virtualenv', 05:37:14 INFO - 'install', 05:37:14 INFO - 'run-tests'), 05:37:14 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:37:14 INFO - 'download_minidump_stackwalk': True, 05:37:14 INFO - 'download_symbols': 'ondemand', 05:37:14 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:37:14 INFO - 'tooltool.py': '/tools/tooltool.py', 05:37:14 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:37:14 INFO - '/tools/misc-python/virtualenv.py')}, 05:37:14 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:37:14 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:37:14 INFO - 'installer_path': 'installer.exe', 05:37:14 INFO - 'log_level': 'info', 05:37:14 INFO - 'log_name': 'talos', 05:37:14 INFO - 'log_to_console': True, 05:37:14 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:37:14 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:37:14 INFO - 'opt_config_files': (), 05:37:14 INFO - 'pip_index': False, 05:37:14 INFO - 'sps_profile': False, 05:37:14 INFO - 'sps_profile_interval': 0, 05:37:14 INFO - 'suite': 'dromaeojs', 05:37:14 INFO - 'system_bits': '32', 05:37:14 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:37:14 INFO - 'title': 'talos-linux64-ix-055', 05:37:14 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:37:14 INFO - 'use_talos_json': True, 05:37:14 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 05:37:14 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:37:14 INFO - 'work_dir': 'build'} 05:37:14 INFO - ##### 05:37:14 INFO - ##### Running clobber step. 05:37:14 INFO - ##### 05:37:14 INFO - Running pre-action listener: _resource_record_pre_action 05:37:14 INFO - Running main action method: clobber 05:37:14 INFO - rmtree: /builds/slave/test-pgo/build 05:37:14 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 05:37:15 INFO - Running post-action listener: _resource_record_post_action 05:37:15 INFO - ##### 05:37:15 INFO - ##### Running read-buildbot-config step. 05:37:15 INFO - ##### 05:37:15 INFO - Running pre-action listener: _resource_record_pre_action 05:37:15 INFO - Running main action method: read_buildbot_config 05:37:15 INFO - Using buildbot properties: 05:37:15 INFO - { 05:37:15 INFO - "project": "", 05:37:15 INFO - "product": "firefox", 05:37:15 INFO - "script_repo_revision": "production", 05:37:15 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 05:37:15 INFO - "repository": "", 05:37:15 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 05:37:15 INFO - "buildid": "20160124030209", 05:37:15 INFO - "stage_platform": "linux64-pgo", 05:37:15 INFO - "basedir": "/builds/slave/test-pgo", 05:37:15 INFO - "nightly_build": "True", 05:37:15 INFO - "buildnumber": 323, 05:37:15 INFO - "slavename": "talos-linux64-ix-055", 05:37:15 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 05:37:15 INFO - "platform": "ubuntu64_hw", 05:37:15 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 05:37:15 INFO - "branch": "mozilla-central", 05:37:15 INFO - "repo_path": "mozilla-central", 05:37:15 INFO - "revision": "d6d81655dd9e146c300a64c0fcaeb04ca3300a19", 05:37:15 INFO - "pgo_build": "True", 05:37:15 INFO - "builduid": "6bd0f170d093450ab0c4cc19ba0509d9", 05:37:15 INFO - "slavebuilddir": "test" 05:37:15 INFO - } 05:37:15 INFO - Found installer url https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 05:37:15 INFO - Running post-action listener: _resource_record_post_action 05:37:15 INFO - ##### 05:37:15 INFO - ##### Running download-and-extract step. 05:37:15 INFO - ##### 05:37:15 INFO - Running pre-action listener: _resource_record_pre_action 05:37:15 INFO - Running main action method: download_and_extract 05:37:15 INFO - mkdir: /builds/slave/test-pgo/build/tests 05:37:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:37:15 INFO - https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 05:37:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/test_packages.json 05:37:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/test_packages.json 05:37:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 05:37:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 05:37:16 INFO - Downloaded 1448 bytes. 05:37:16 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 05:37:16 INFO - Using the following test package requirements: 05:37:16 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 05:37:16 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:37:16 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:37:16 INFO - u'gtest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:37:16 INFO - u'firefox-46.0a1.en-US.linux-x86_64.gtest.tests.zip'], 05:37:16 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:37:16 INFO - u'jsshell-linux-x86_64.zip'], 05:37:16 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:37:16 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:37:16 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 05:37:16 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:37:16 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:37:16 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:37:16 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:37:16 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:37:16 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:37:16 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 05:37:16 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 05:37:16 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:37:16 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:37:16 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')]} 05:37:16 INFO - https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:37:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 05:37:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 05:37:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/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 05:37:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/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 05:37:17 INFO - Downloaded 22490894 bytes. 05:37:17 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 05:37:17 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 05:37:18 INFO - Return code: 0 05:37:18 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 05:37:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:37:18 INFO - https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:37:18 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 05:37:18 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 05:37:18 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/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 05:37:18 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/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 05:37:22 INFO - Downloaded 22490894 bytes. 05:37:22 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 05:37:22 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 05:37:23 INFO - Return code: 0 05:37:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:37:23 INFO - https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 05:37:23 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 05:37:23 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 05:37:23 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/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 05:37:23 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/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 05:37:24 INFO - Downloaded 10706572 bytes. 05:37:24 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 05:37:24 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 05:37:24 INFO - Return code: 0 05:37:24 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')]} 05:37:24 INFO - https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 05:37:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 05:37:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 05:37:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/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 05:37:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/JqfwjRB1TV-UfdqWeHVnFg/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 05:37:26 INFO - Downloaded 55976028 bytes. 05:37:26 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 05:37:26 INFO - mkdir: /builds/slave/test-pgo/properties 05:37:26 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 05:37:26 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 05:37:26 INFO - Contents: 05:37:26 INFO - build_url:https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 05:37:26 INFO - Running post-action listener: _resource_record_post_action 05:37:26 INFO - Running post-action listener: set_extra_try_arguments 05:37:26 INFO - ##### 05:37:26 INFO - ##### Running populate-webroot step. 05:37:26 INFO - ##### 05:37:26 INFO - Running pre-action listener: _resource_record_pre_action 05:37:26 INFO - Running main action method: populate_webroot 05:37:26 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:37:26 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:37:26 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:37:26 INFO - '--tppagecycles', 05:37:26 INFO - '7'], 05:37:26 INFO - 'tests': ['tsvgm']}}, 05:37:26 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:37:26 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:37:26 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:37:26 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:37:26 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:37:26 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:37:26 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:37:26 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:37:26 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:37:26 INFO - 'talos_options': ['--e10s'], 05:37:26 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:37:26 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:37:26 INFO - 'tests': ['damp', 'tps']}, 05:37:26 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:37:26 INFO - 'talos_options': ['--e10s'], 05:37:26 INFO - 'tests': ['damp', 'tps']}, 05:37:26 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:37:26 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:37:26 INFO - 'other': {'tests': ['a11yr', 05:37:26 INFO - 'ts_paint', 05:37:26 INFO - 'tpaint', 05:37:26 INFO - 'sessionrestore', 05:37:26 INFO - 'sessionrestore_no_auto_restore']}, 05:37:26 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:37:26 INFO - 'tests': ['a11yr', 05:37:26 INFO - 'ts_paint', 05:37:26 INFO - 'tpaint', 05:37:26 INFO - 'sessionrestore', 05:37:26 INFO - 'sessionrestore_no_auto_restore']}, 05:37:26 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:37:26 INFO - 'tests': ['a11yr', 05:37:26 INFO - 'ts_paint', 05:37:26 INFO - 'tpaint', 05:37:26 INFO - 'sessionrestore', 05:37:26 INFO - 'sessionrestore_no_auto_restore']}, 05:37:26 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:37:26 INFO - 'tests': ['a11yr', 05:37:26 INFO - 'ts_paint', 05:37:26 INFO - 'tpaint', 05:37:26 INFO - 'sessionrestore', 05:37:26 INFO - 'sessionrestore_no_auto_restore']}, 05:37:26 INFO - 'other_l64': {'tests': ['a11yr', 05:37:26 INFO - 'ts_paint', 05:37:26 INFO - 'tpaint', 05:37:26 INFO - 'sessionrestore', 05:37:26 INFO - 'sessionrestore_no_auto_restore']}, 05:37:26 INFO - 'other_nol64': {'tests': ['a11yr', 05:37:26 INFO - 'ts_paint', 05:37:26 INFO - 'tpaint', 05:37:26 INFO - 'sessionrestore', 05:37:26 INFO - 'sessionrestore_no_auto_restore']}, 05:37:26 INFO - 'svgr': {'tests': ['tsvgx', 05:37:26 INFO - 'tsvgr_opacity', 05:37:26 INFO - 'tart', 05:37:26 INFO - 'tscrollx', 05:37:26 INFO - 'cart']}, 05:37:26 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:37:26 INFO - 'tests': ['tsvgx', 05:37:26 INFO - 'tsvgr_opacity', 05:37:26 INFO - 'tart', 05:37:26 INFO - 'tscrollx', 05:37:26 INFO - 'cart']}, 05:37:26 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:37:26 INFO - 'tests': ['tp5o']}, 05:37:26 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:37:26 INFO - 'talos_options': ['--e10s'], 05:37:26 INFO - 'tests': ['tp5o']}, 05:37:26 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:37:26 INFO - 'talos_options': ['--xperf_path', 05:37:26 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:37:26 INFO - 'tests': ['tp5n']}, 05:37:26 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:37:26 INFO - 'talos_options': ['--e10s', 05:37:26 INFO - '--xperf_path', 05:37:26 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:37:26 INFO - 'tests': ['tp5n']}}, 05:37:26 INFO - 'talos.zip': {'path': '', 05:37:26 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:37:26 INFO - Running post-action listener: _resource_record_post_action 05:37:26 INFO - ##### 05:37:26 INFO - ##### Running create-virtualenv step. 05:37:26 INFO - ##### 05:37:26 INFO - Running pre-action listener: _resource_record_pre_action 05:37:26 INFO - Running main action method: create_virtualenv 05:37:26 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 05:37:26 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 05:37:26 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 05:37:26 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:37:26 INFO - Using real prefix '/usr' 05:37:26 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 05:37:26 INFO - Installing distribute.............................................................................................................................................................................................done. 05:37:28 INFO - Installing pip.................done. 05:37:28 INFO - Return code: 0 05:37:28 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 05:37:28 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')]} 05:37:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:28 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')]} 05:37:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:28 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc106d36f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c1b630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cac840>, '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 0x2c196b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c19b60>, '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': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', '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 05:37:28 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 05:37:28 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 05:37:28 INFO - Using env: {'DISPLAY': ':0', 05:37:28 INFO - 'HOME': '/home/cltbld', 05:37:28 INFO - 'LANG': 'en_US.UTF-8', 05:37:28 INFO - 'LANGUAGE': 'en_US:en', 05:37:28 INFO - 'LOGNAME': 'cltbld', 05:37:28 INFO - 'MAIL': '/var/mail/cltbld', 05:37:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:28 INFO - 'MOZ_NO_REMOTE': '1', 05:37:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:28 INFO - 'NO_EM_RESTART': '1', 05:37:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:37:28 INFO - 'PWD': '/builds/slave/test-pgo', 05:37:28 INFO - 'SHELL': '/bin/bash', 05:37:28 INFO - 'SHLVL': '1', 05:37:28 INFO - 'TERM': 'linux', 05:37:28 INFO - 'TMOUT': '86400', 05:37:28 INFO - 'USER': 'cltbld', 05:37:28 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', 05:37:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:28 INFO - '_': '/tools/buildbot/bin/python'} 05:37:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:29 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 05:37:29 INFO - Cleaning up... 05:37:29 INFO - Return code: 0 05:37:29 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 05:37:29 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')]} 05:37:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:29 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')]} 05:37:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:29 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc106d36f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c1b630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cac840>, '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 0x2c196b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c19b60>, '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': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', '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 05:37:29 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 05:37:29 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 05:37:29 INFO - Using env: {'DISPLAY': ':0', 05:37:29 INFO - 'HOME': '/home/cltbld', 05:37:29 INFO - 'LANG': 'en_US.UTF-8', 05:37:29 INFO - 'LANGUAGE': 'en_US:en', 05:37:29 INFO - 'LOGNAME': 'cltbld', 05:37:29 INFO - 'MAIL': '/var/mail/cltbld', 05:37:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:29 INFO - 'MOZ_NO_REMOTE': '1', 05:37:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:29 INFO - 'NO_EM_RESTART': '1', 05:37:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:37:29 INFO - 'PWD': '/builds/slave/test-pgo', 05:37:29 INFO - 'SHELL': '/bin/bash', 05:37:29 INFO - 'SHLVL': '1', 05:37:29 INFO - 'TERM': 'linux', 05:37:29 INFO - 'TMOUT': '86400', 05:37:29 INFO - 'USER': 'cltbld', 05:37:29 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', 05:37:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:29 INFO - '_': '/tools/buildbot/bin/python'} 05:37:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:29 INFO - Downloading/unpacking psutil>=0.7.1 05:37:29 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 05:37:29 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 05:37:29 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 05:37:29 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 05:37:29 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 05:37:29 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 05:37:31 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 05:37:31 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:37:31 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:37:31 INFO - Installing collected packages: psutil 05:37:31 INFO - Running setup.py install for psutil 05:37:31 INFO - building 'psutil._psutil_linux' extension 05:37:31 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 05:37:31 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 05:37:31 INFO - building 'psutil._psutil_posix' extension 05:37:31 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 05:37:31 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 05:37:31 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:37:31 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:37:31 INFO - Successfully installed psutil 05:37:31 INFO - Cleaning up... 05:37:31 INFO - Return code: 0 05:37:31 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 05:37:31 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')]} 05:37:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:31 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')]} 05:37:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:31 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc106d36f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c1b630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cac840>, '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 0x2c196b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c19b60>, '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': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', '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 05:37:31 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 05:37:31 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 05:37:31 INFO - Using env: {'DISPLAY': ':0', 05:37:31 INFO - 'HOME': '/home/cltbld', 05:37:31 INFO - 'LANG': 'en_US.UTF-8', 05:37:31 INFO - 'LANGUAGE': 'en_US:en', 05:37:31 INFO - 'LOGNAME': 'cltbld', 05:37:31 INFO - 'MAIL': '/var/mail/cltbld', 05:37:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:31 INFO - 'MOZ_NO_REMOTE': '1', 05:37:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:31 INFO - 'NO_EM_RESTART': '1', 05:37:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:37:31 INFO - 'PWD': '/builds/slave/test-pgo', 05:37:31 INFO - 'SHELL': '/bin/bash', 05:37:31 INFO - 'SHLVL': '1', 05:37:31 INFO - 'TERM': 'linux', 05:37:31 INFO - 'TMOUT': '86400', 05:37:31 INFO - 'USER': 'cltbld', 05:37:31 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', 05:37:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:31 INFO - '_': '/tools/buildbot/bin/python'} 05:37:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:32 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:37:32 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 05:37:32 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 05:37:32 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 05:37:32 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 05:37:32 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 05:37:32 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 05:37:33 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:37:33 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:37:33 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 05:37:33 INFO - Installing collected packages: mozsystemmonitor 05:37:33 INFO - Running setup.py install for mozsystemmonitor 05:37:33 INFO - Successfully installed mozsystemmonitor 05:37:33 INFO - Cleaning up... 05:37:33 INFO - Return code: 0 05:37:33 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 05:37:33 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')]} 05:37:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:33 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')]} 05:37:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:33 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc106d36f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c1b630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cac840>, '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 0x2c196b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c19b60>, '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': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', '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 05:37:33 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 05:37:33 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 05:37:33 INFO - Using env: {'DISPLAY': ':0', 05:37:33 INFO - 'HOME': '/home/cltbld', 05:37:33 INFO - 'LANG': 'en_US.UTF-8', 05:37:33 INFO - 'LANGUAGE': 'en_US:en', 05:37:33 INFO - 'LOGNAME': 'cltbld', 05:37:33 INFO - 'MAIL': '/var/mail/cltbld', 05:37:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:33 INFO - 'MOZ_NO_REMOTE': '1', 05:37:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:33 INFO - 'NO_EM_RESTART': '1', 05:37:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:37:33 INFO - 'PWD': '/builds/slave/test-pgo', 05:37:33 INFO - 'SHELL': '/bin/bash', 05:37:33 INFO - 'SHLVL': '1', 05:37:33 INFO - 'TERM': 'linux', 05:37:33 INFO - 'TMOUT': '86400', 05:37:33 INFO - 'USER': 'cltbld', 05:37:33 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', 05:37:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:33 INFO - '_': '/tools/buildbot/bin/python'} 05:37:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:34 INFO - Downloading/unpacking blobuploader==1.2.4 05:37:34 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 05:37:34 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 05:37:34 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 05:37:34 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 05:37:34 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 05:37:34 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 05:37:35 INFO - Downloading blobuploader-1.2.4.tar.gz 05:37:35 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:37:35 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:37:35 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 05:37:35 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 05:37:35 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 05:37:35 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 05:37:35 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 05:37:35 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 05:37:36 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 05:37:36 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:37:36 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 05:37:36 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 05:37:36 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 05:37:36 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 05:37:36 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 05:37:36 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 05:37:36 INFO - Downloading docopt-0.6.1.tar.gz 05:37:36 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 05:37:36 INFO - Installing collected packages: blobuploader, requests, docopt 05:37:36 INFO - Running setup.py install for blobuploader 05:37:36 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:37:36 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 05:37:36 INFO - Running setup.py install for requests 05:37:37 INFO - Running setup.py install for docopt 05:37:37 INFO - Successfully installed blobuploader requests docopt 05:37:37 INFO - Cleaning up... 05:37:37 INFO - Return code: 0 05:37:37 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:37:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:37:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:37:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:37 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc106d36f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c1b630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cac840>, '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 0x2c196b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c19b60>, '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': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', '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 05:37:37 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 05:37:37 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:37:37 INFO - Using env: {'DISPLAY': ':0', 05:37:37 INFO - 'HOME': '/home/cltbld', 05:37:37 INFO - 'LANG': 'en_US.UTF-8', 05:37:37 INFO - 'LANGUAGE': 'en_US:en', 05:37:37 INFO - 'LOGNAME': 'cltbld', 05:37:37 INFO - 'MAIL': '/var/mail/cltbld', 05:37:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:37 INFO - 'MOZ_NO_REMOTE': '1', 05:37:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:37 INFO - 'NO_EM_RESTART': '1', 05:37:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:37:37 INFO - 'PWD': '/builds/slave/test-pgo', 05:37:37 INFO - 'SHELL': '/bin/bash', 05:37:37 INFO - 'SHLVL': '1', 05:37:37 INFO - 'TERM': 'linux', 05:37:37 INFO - 'TMOUT': '86400', 05:37:37 INFO - 'USER': 'cltbld', 05:37:37 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', 05:37:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:37 INFO - '_': '/tools/buildbot/bin/python'} 05:37:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:37:37 INFO - Running setup.py (path:/tmp/pip-2tYQ7e-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:37:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:37:37 INFO - Running setup.py (path:/tmp/pip-zAkgV1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:37:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:37:37 INFO - Running setup.py (path:/tmp/pip-B6VRSM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:37:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:37:37 INFO - Running setup.py (path:/tmp/pip-h5KCpY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:37:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 05:37:37 INFO - Running setup.py (path:/tmp/pip-as0Fcy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 05:37:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:37:37 INFO - Running setup.py (path:/tmp/pip-aEfSE9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:37:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:37:37 INFO - Running setup.py (path:/tmp/pip-ltj8Dr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:37:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:37:37 INFO - Running setup.py (path:/tmp/pip-TCZ5Lq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:37:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 05:37:38 INFO - Running setup.py (path:/tmp/pip-vMYTMQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 05:37:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 05:37:38 INFO - Running setup.py (path:/tmp/pip-2iJ9kL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 05:37:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:37:38 INFO - Running setup.py (path:/tmp/pip-ehw3MY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:37:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:37:38 INFO - Running setup.py (path:/tmp/pip-hC7yGS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:37:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:37:38 INFO - Running setup.py (path:/tmp/pip-41kh1U-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:37:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:37:38 INFO - Running setup.py (path:/tmp/pip-CqSCAS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:37:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:37:38 INFO - Running setup.py (path:/tmp/pip-zyDxFD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:37:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 05:37:38 INFO - Running setup.py (path:/tmp/pip-8_YxHB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 05:37:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 05:37:38 INFO - Running setup.py (path:/tmp/pip-sGaY3T-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 05:37:38 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:37:38 INFO - Running setup.py install for manifestparser 05:37:38 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 05:37:38 INFO - Running setup.py install for mozcrash 05:37:38 INFO - Running setup.py install for mozdebug 05:37:38 INFO - Running setup.py install for mozdevice 05:37:39 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 05:37:39 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 05:37:39 INFO - Running setup.py install for mozfile 05:37:39 INFO - Running setup.py install for mozhttpd 05:37:39 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 05:37:39 INFO - Running setup.py install for mozinfo 05:37:39 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 05:37:39 INFO - Running setup.py install for mozInstall 05:37:39 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 05:37:39 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 05:37:39 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 05:37:39 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 05:37:39 INFO - Running setup.py install for mozleak 05:37:39 INFO - Running setup.py install for mozlog 05:37:39 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 05:37:39 INFO - Running setup.py install for moznetwork 05:37:39 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 05:37:39 INFO - Running setup.py install for mozprocess 05:37:39 INFO - Running setup.py install for mozprofile 05:37:40 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 05:37:40 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 05:37:40 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 05:37:40 INFO - Running setup.py install for mozrunner 05:37:40 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 05:37:40 INFO - Running setup.py install for mozscreenshot 05:37:40 INFO - Running setup.py install for moztest 05:37:40 INFO - Running setup.py install for mozversion 05:37:40 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 05:37:40 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:37:40 INFO - Cleaning up... 05:37:40 INFO - Return code: 0 05:37:40 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:37: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')]} 05:37:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37: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')]} 05:37:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:40 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc106d36f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c1b630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cac840>, '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 0x2c196b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c19b60>, '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': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', '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 05:37:40 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 05:37:40 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:37:40 INFO - Using env: {'DISPLAY': ':0', 05:37:40 INFO - 'HOME': '/home/cltbld', 05:37:40 INFO - 'LANG': 'en_US.UTF-8', 05:37:40 INFO - 'LANGUAGE': 'en_US:en', 05:37:40 INFO - 'LOGNAME': 'cltbld', 05:37:40 INFO - 'MAIL': '/var/mail/cltbld', 05:37:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:40 INFO - 'MOZ_NO_REMOTE': '1', 05:37:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:40 INFO - 'NO_EM_RESTART': '1', 05:37:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:37:40 INFO - 'PWD': '/builds/slave/test-pgo', 05:37:40 INFO - 'SHELL': '/bin/bash', 05:37:40 INFO - 'SHLVL': '1', 05:37:40 INFO - 'TERM': 'linux', 05:37:40 INFO - 'TMOUT': '86400', 05:37:40 INFO - 'USER': 'cltbld', 05:37:40 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', 05:37:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:40 INFO - '_': '/tools/buildbot/bin/python'} 05:37:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:37:40 INFO - Running setup.py (path:/tmp/pip-3XsqVV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:37:40 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)) 05:37:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:37:40 INFO - Running setup.py (path:/tmp/pip-DT2hEt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:37:40 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)) 05:37:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:37:40 INFO - Running setup.py (path:/tmp/pip-PFmu9I-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:37:40 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)) 05:37:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:37:40 INFO - Running setup.py (path:/tmp/pip-iaG2uJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:37:40 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)) 05:37:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 05:37:40 INFO - Running setup.py (path:/tmp/pip-JB3zVW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 05:37:41 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)) 05:37:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:37:41 INFO - Running setup.py (path:/tmp/pip-VOWuJu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:37:41 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)) 05:37:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:37:41 INFO - Running setup.py (path:/tmp/pip-DmK83j-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:37:41 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)) 05:37:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:37:41 INFO - Running setup.py (path:/tmp/pip-My_1gn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:37:41 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)) 05:37:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 05:37:41 INFO - Running setup.py (path:/tmp/pip-VNTB_M-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 05:37:41 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)) 05:37:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 05:37:41 INFO - Running setup.py (path:/tmp/pip-wTX_LL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 05:37:41 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)) 05:37:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:37:41 INFO - Running setup.py (path:/tmp/pip-69OFK3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:37:41 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)) 05:37:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:37:41 INFO - Running setup.py (path:/tmp/pip-_YsHlq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:37:41 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)) 05:37:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:37:41 INFO - Running setup.py (path:/tmp/pip-IHWJhd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:37:41 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)) 05:37:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:37:41 INFO - Running setup.py (path:/tmp/pip-ik8rCU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:37:41 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)) 05:37:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:37:41 INFO - Running setup.py (path:/tmp/pip-cyv_qn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:37:41 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)) 05:37:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 05:37:41 INFO - Running setup.py (path:/tmp/pip-54DnnA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 05:37:41 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)) 05:37:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 05:37:41 INFO - Running setup.py (path:/tmp/pip-82JJCu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 05:37:41 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)) 05:37:41 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)) 05:37:41 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)) 05:37:41 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)) 05:37:41 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)) 05:37:41 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)) 05:37:41 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 05:37:41 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 05:37:41 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 05:37:41 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 05:37:41 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 05:37:41 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 05:37:41 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 05:37:43 INFO - Downloading blessings-1.6.tar.gz 05:37:43 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 05:37:43 INFO - Installing collected packages: blessings 05:37:43 INFO - Running setup.py install for blessings 05:37:43 INFO - Successfully installed blessings 05:37:43 INFO - Cleaning up... 05:37:43 INFO - Return code: 0 05:37:43 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 05:37:43 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 05:37:43 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 05:37:44 INFO - Reading from file tmpfile_stdout 05:37:44 INFO - Current package versions: 05:37:44 INFO - argparse == 1.2.1 05:37:44 INFO - blessings == 1.6 05:37:44 INFO - blobuploader == 1.2.4 05:37:44 INFO - docopt == 0.6.1 05:37:44 INFO - manifestparser == 1.1 05:37:44 INFO - mozInstall == 1.12 05:37:44 INFO - mozcrash == 0.16 05:37:44 INFO - mozdebug == 0.1 05:37:44 INFO - mozdevice == 0.48 05:37:44 INFO - mozfile == 1.2 05:37:44 INFO - mozhttpd == 0.7 05:37:44 INFO - mozinfo == 0.9 05:37:44 INFO - mozleak == 0.1 05:37:44 INFO - mozlog == 3.1 05:37:44 INFO - moznetwork == 0.27 05:37:44 INFO - mozprocess == 0.22 05:37:44 INFO - mozprofile == 0.28 05:37:44 INFO - mozrunner == 6.11 05:37:44 INFO - mozscreenshot == 0.1 05:37:44 INFO - mozsystemmonitor == 0.0 05:37:44 INFO - moztest == 0.7 05:37:44 INFO - mozversion == 1.4 05:37:44 INFO - psutil == 3.1.1 05:37:44 INFO - requests == 1.2.3 05:37:44 INFO - wsgiref == 0.1.2 05:37:44 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:37:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:37:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:37:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:44 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc106d36f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c1b630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cac840>, '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 0x2c196b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c19b60>, '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': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', '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 05:37:44 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/talos 05:37:44 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:37:44 INFO - Using env: {'DISPLAY': ':0', 05:37:44 INFO - 'HOME': '/home/cltbld', 05:37:44 INFO - 'LANG': 'en_US.UTF-8', 05:37:44 INFO - 'LANGUAGE': 'en_US:en', 05:37:44 INFO - 'LOGNAME': 'cltbld', 05:37:44 INFO - 'MAIL': '/var/mail/cltbld', 05:37:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:44 INFO - 'MOZ_NO_REMOTE': '1', 05:37:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:44 INFO - 'NO_EM_RESTART': '1', 05:37:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:37:44 INFO - 'PWD': '/builds/slave/test-pgo', 05:37:44 INFO - 'SHELL': '/bin/bash', 05:37:44 INFO - 'SHLVL': '1', 05:37:44 INFO - 'TERM': 'linux', 05:37:44 INFO - 'TMOUT': '86400', 05:37:44 INFO - 'USER': 'cltbld', 05:37:44 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', 05:37:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:44 INFO - '_': '/tools/buildbot/bin/python'} 05:37:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:44 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)) 05:37:44 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)) 05:37:44 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)) 05:37:44 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)) 05:37:44 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)) 05:37:44 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)) 05:37:44 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)) 05:37:44 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)) 05:37:44 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)) 05:37:44 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)) 05:37:44 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)) 05:37:44 INFO - Cleaning up... 05:37:44 INFO - Return code: 0 05:37:44 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 05:37:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:37:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:37:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:44 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc106d36f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c1b630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cac840>, '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 0x2c196b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c19b60>, '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': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', '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 05:37:44 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test-pgo/build 05:37:44 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 05:37:44 INFO - Using env: {'DISPLAY': ':0', 05:37:44 INFO - 'HOME': '/home/cltbld', 05:37:44 INFO - 'LANG': 'en_US.UTF-8', 05:37:44 INFO - 'LANGUAGE': 'en_US:en', 05:37:44 INFO - 'LOGNAME': 'cltbld', 05:37:44 INFO - 'MAIL': '/var/mail/cltbld', 05:37:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:44 INFO - 'MOZ_NO_REMOTE': '1', 05:37:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:44 INFO - 'NO_EM_RESTART': '1', 05:37:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:37:44 INFO - 'PWD': '/builds/slave/test-pgo', 05:37:44 INFO - 'SHELL': '/bin/bash', 05:37:44 INFO - 'SHLVL': '1', 05:37:44 INFO - 'TERM': 'linux', 05:37:44 INFO - 'TMOUT': '86400', 05:37:44 INFO - 'USER': 'cltbld', 05:37:44 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', 05:37:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:44 INFO - '_': '/tools/buildbot/bin/python'} 05:37:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:44 INFO - Downloading/unpacking jsonschema 05:37:44 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 05:37:44 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 05:37:44 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 05:37:44 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 05:37:44 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 05:37:44 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 05:37:46 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:37:46 INFO - Downloading/unpacking functools32 (from jsonschema) 05:37:46 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 05:37:46 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 05:37:46 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 05:37:46 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 05:37:46 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 05:37:46 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 05:37:46 INFO - Downloading functools32-3.2.3-2.tar.gz 05:37:46 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 05:37:46 INFO - warning: no files found matching '*.txt' 05:37:46 INFO - no previously-included directories found matching 'build' 05:37:46 INFO - no previously-included directories found matching 'dist' 05:37:46 INFO - no previously-included directories found matching '.git*' 05:37:46 INFO - Installing collected packages: jsonschema, functools32 05:37:46 INFO - Running setup.py install for functools32 05:37:46 INFO - warning: no files found matching '*.txt' 05:37:46 INFO - no previously-included directories found matching 'build' 05:37:46 INFO - no previously-included directories found matching 'dist' 05:37:46 INFO - no previously-included directories found matching '.git*' 05:37:46 INFO - Successfully installed jsonschema functools32 05:37:46 INFO - Cleaning up... 05:37:46 INFO - Return code: 0 05:37:46 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 05:37:46 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')]} 05:37:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:46 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')]} 05:37:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:37:46 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fc106d36f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b4b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2c1b630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cac840>, '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 0x2c196b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c19b60>, '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': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', '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 05:37:46 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test-pgo/build 05:37:46 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 05:37:46 INFO - Using env: {'DISPLAY': ':0', 05:37:46 INFO - 'HOME': '/home/cltbld', 05:37:46 INFO - 'LANG': 'en_US.UTF-8', 05:37:46 INFO - 'LANGUAGE': 'en_US:en', 05:37:46 INFO - 'LOGNAME': 'cltbld', 05:37:46 INFO - 'MAIL': '/var/mail/cltbld', 05:37:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:46 INFO - 'MOZ_NO_REMOTE': '1', 05:37:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:46 INFO - 'NO_EM_RESTART': '1', 05:37:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:37:46 INFO - 'PWD': '/builds/slave/test-pgo', 05:37:46 INFO - 'SHELL': '/bin/bash', 05:37:46 INFO - 'SHLVL': '1', 05:37:46 INFO - 'TERM': 'linux', 05:37:46 INFO - 'TMOUT': '86400', 05:37:46 INFO - 'USER': 'cltbld', 05:37:46 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', 05:37:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:46 INFO - '_': '/tools/buildbot/bin/python'} 05:37:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:47 INFO - Downloading/unpacking flake8 05:37:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:47 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:37:47 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:37:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:48 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 05:37:48 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 05:37:48 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 05:37:48 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 05:37:48 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 05:37:48 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 05:37:48 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 05:37:48 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 05:37:49 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 05:37:49 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 05:37: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 05:37: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 05:37: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 05:37: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 05:37: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 05:37: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 05:37:49 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 05:37: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 05:37: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 05:37: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 05:37: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 05:37: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 05:37: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 05:37:49 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 05:37:49 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:37:49 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:37:49 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:37:49 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:37:49 INFO - no previously-included directories found matching 'docs/_build' 05:37:49 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 05:37:49 INFO - Running setup.py install for pep8 05:37:49 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 05:37:49 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 05:37:49 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 05:37:49 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 05:37:49 INFO - no previously-included directories found matching 'docs/_build' 05:37:49 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 05:37:49 INFO - Successfully installed flake8 mccabe pyflakes pep8 05:37:49 INFO - Cleaning up... 05:37:49 INFO - Return code: 0 05:37:49 INFO - Running post-action listener: _resource_record_post_action 05:37:49 INFO - Running post-action listener: _start_resource_monitoring 05:37:49 INFO - Starting resource monitoring. 05:37:49 INFO - ##### 05:37:49 INFO - ##### Running install step. 05:37:49 INFO - ##### 05:37:49 INFO - Running pre-action listener: _resource_record_pre_action 05:37:49 INFO - Running main action method: install 05:37:49 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 05:37:49 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 05:37:50 INFO - Reading from file tmpfile_stdout 05:37:50 INFO - Detecting whether we're running mozinstall >=1.0... 05:37:50 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 05:37:50 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 05:37:50 INFO - Reading from file tmpfile_stdout 05:37:50 INFO - Output received: 05:37:50 INFO - Usage: mozinstall [options] installer 05:37:50 INFO - Options: 05:37:50 INFO - -h, --help show this help message and exit 05:37:50 INFO - -d DEST, --destination=DEST 05:37:50 INFO - Directory to install application into. [default: 05:37:50 INFO - "/builds/slave/test-pgo"] 05:37:50 INFO - --app=APP Application being installed. [default: firefox] 05:37:50 INFO - mkdir: /builds/slave/test-pgo/build/application 05:37:50 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'] 05:37:50 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 05:38:06 INFO - Reading from file tmpfile_stdout 05:38:06 INFO - Output received: 05:38:06 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 05:38:06 INFO - Running post-action listener: _resource_record_post_action 05:38:06 INFO - ##### 05:38:06 INFO - ##### Running run-tests step. 05:38:06 INFO - ##### 05:38:06 INFO - Running pre-action listener: _resource_record_pre_action 05:38:06 INFO - Running main action method: run_tests 05:38:06 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 05:38:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 05:38:06 INFO - Python 2.7.3 05:38:06 INFO - Return code: 0 05:38:06 INFO - grabbing minidump binary from tooltool 05:38:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:38:06 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 0x2cac840>, '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 0x2c196b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2c19b60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 05:38:06 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 05:38:06 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 05:38:06 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:38:06 INFO - Return code: 0 05:38:06 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 05:38:06 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 05:38:06 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 05:38:06 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 05:38:06 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 05:38:06 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 05:38:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 05:38:07 INFO - Return code: 0 05:38:07 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-055', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build 05:38:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-055 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log 05:38:07 INFO - Using env: {'DISPLAY': ':0', 05:38:07 INFO - 'HOME': '/home/cltbld', 05:38:07 INFO - 'LANG': 'en_US.UTF-8', 05:38:07 INFO - 'LANGUAGE': 'en_US:en', 05:38:07 INFO - 'LOGNAME': 'cltbld', 05:38:07 INFO - 'MAIL': '/var/mail/cltbld', 05:38:07 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 05:38:07 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 05:38:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:38:07 INFO - 'MOZ_NO_REMOTE': '1', 05:38:07 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 05:38:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:38:07 INFO - 'NO_EM_RESTART': '1', 05:38:07 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:38:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:38:07 INFO - 'PWD': '/builds/slave/test-pgo', 05:38:07 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 05:38:07 INFO - 'SHELL': '/bin/bash', 05:38:07 INFO - 'SHLVL': '1', 05:38:07 INFO - 'TERM': 'linux', 05:38:07 INFO - 'TMOUT': '86400', 05:38:07 INFO - 'USER': 'cltbld', 05:38:07 INFO - 'XDG_SESSION_COOKIE': '82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806', 05:38:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:38:07 INFO - '_': '/tools/buildbot/bin/python'} 05:38:07 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-055', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 05:38:07 INFO - mozversion application_buildid: 20160124030209 05:38:07 INFO - mozversion application_changeset: d6d81655dd9e146c300a64c0fcaeb04ca3300a19 05:38:07 INFO - mozversion application_display_name: Nightly 05:38:07 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:38:07 INFO - mozversion application_name: Firefox 05:38:07 INFO - mozversion application_remotingname: firefox 05:38:07 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 05:38:07 INFO - mozversion application_vendor: Mozilla 05:38:07 INFO - mozversion application_version: 46.0a1 05:38:07 INFO - mozversion platform_buildid: 20160124030209 05:38:07 INFO - mozversion platform_changeset: d6d81655dd9e146c300a64c0fcaeb04ca3300a19 05:38:07 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 05:38:07 INFO - mozversion platform_version: 46.0a1 05:38:07 INFO - using testdate: 1453642687 05:38:07 INFO - actual date: 1453642687 05:38:07 INFO - starting webserver on 'localhost:54682' 05:38:07 INFO - SUITE-START | Running 3 tests 05:38:07 INFO - TEST-START | dromaeo_css 05:38:07 INFO - operating with platform_type : linux_ 05:38:07 INFO - Initialising browser for dromaeo_css test... 05:38:07 INFO - TEST-INFO | started process 15006 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpEU5EW0/profile http://localhost:54682/getInfo.html) 05:38:11 INFO - PROCESS | 15006 | __metrics Screen width/height:1600/1200 05:38:11 INFO - PROCESS | 15006 | colorDepth:24 05:38:11 INFO - PROCESS | 15006 | Browser inner width/height: 1024/697 05:38:11 INFO - PROCESS | 15006 | __metrics 05:38:11 INFO - PROCESS | 15006 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 05:38:12 INFO - PROCESS | 15006 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:38:12 INFO - TEST-INFO | 15006: exit 0 05:38:12 INFO - Browser initialized. 05:38:12 INFO - Running cycle 1/1 for dromaeo_css test... 05:38:12 INFO - TEST-INFO | started process 15098 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpEU5EW0/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:38:24 INFO - PROCESS | 15098 | RSS: Main: 148131840 05:38:24 INFO - PROCESS | 15098 | 05:39:16 INFO - PROCESS | 15098 | 1453642756144 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] 05:41:24 INFO - PROCESS | 15098 | Cycle 1(1): loaded http://localhost:54682/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54682/tests/dromaeo/cssquery-ext.html) 05:41:25 INFO - PROCESS | 15098 | RSS: Main: 269303808 05:41:25 INFO - PROCESS | 15098 | 05:44:28 INFO - PROCESS | 15098 | Cycle 1(1): loaded http://localhost:54682/tests/dromaeo/cssquery-ext.html (next: http://localhost:54682/tests/dromaeo/cssquery-jquery.html) 05:44:28 INFO - PROCESS | 15098 | RSS: Main: 239669248 05:44:28 INFO - PROCESS | 15098 | 05:47:30 INFO - PROCESS | 15098 | Cycle 1(1): loaded http://localhost:54682/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54682/tests/dromaeo/cssquery-mootools.html) 05:47:31 INFO - PROCESS | 15098 | RSS: Main: 239321088 05:47:31 INFO - PROCESS | 15098 | 05:50:33 INFO - PROCESS | 15098 | Cycle 1(1): loaded http://localhost:54682/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54682/tests/dromaeo/cssquery-prototype.html) 05:50:33 INFO - PROCESS | 15098 | RSS: Main: 213831680 05:50:33 INFO - PROCESS | 15098 | 05:53:36 INFO - PROCESS | 15098 | Cycle 1(1): loaded http://localhost:54682/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54682/tests/dromaeo/cssquery-yui.html) 05:53:36 INFO - PROCESS | 15098 | RSS: Main: 217108480 05:53:36 INFO - PROCESS | 15098 | 05:56:39 INFO - PROCESS | 15098 | Cycle 1(1): loaded http://localhost:54682/tests/dromaeo/cssquery-yui.html (next: http://localhost:54682/tests/dromaeo/cssquery-dojo.html) 05:56:39 INFO - PROCESS | 15098 | RSS: Main: 323579904 05:56:39 INFO - PROCESS | 15098 | 05:56:39 INFO - PROCESS | 15098 | __start_tp_report 05:56:39 INFO - PROCESS | 15098 | _x_x_mozilla_page_load 05:56:39 INFO - PROCESS | 15098 | _x_x_mozilla_page_load_details 05:56:39 INFO - PROCESS | 15098 | |i|pagename|runs| 05:56:39 INFO - PROCESS | 15098 | |0;dojo.html;3105.953410698839;3125.8749650014;3131.5772370729946;3134.3574567213723;3164.193130751659;5045.217991211359;5151.76817043233;5202.505761952613;5234.581233501315;5269.18327659213;5052.393712754465;5137.897242055156;5232.8691782705455;5242.21366794981;5243.265942768006;4718.009218064202;4749.952500474986;4750.667453278272;4778.331033655291;4805.639577031719;4416;4786.282057691339;4846.466888642264;4864.221724524077;4902.044101400228;4664.930026049612;4729.716217026955;4806.375171227718;4841.15279826029;4846.539578740014;4656.580907718288;4665;4730.148573256813;4805.135075686375;4818.710877347336;4719.646026547988;4727.95272047282;4729.905401891977;4736.928946065812;4757.167495688241;5022;5070.670406423571;5079.390473143209;5093.567046800989;5134.614903882224;5453.836384908459;5509.696966666832;5527.50252477275;5564.749586268627;5611;5543.8891222175735;5557.221988921554;5557.972210138963;5562.0266453370905;5563.888722225533;5034.546890779848;5208.947910520884;5213.426523082496;5214.165733482662;5217.921731174036;5587.972060139673;5606.915896261559;5650.26546548946;5657.547396208293;5708.457696518824;5519.39286678465;5522.144067669437;5525.778968841281;5531;5534.557235421237;5387.757550910218;5590.832275031756;5606.439356064442;5607.074832652648;5610.354809196913;5424.1321388577635;5598.272224610774;5635.577331700057;5655.236543066716;5706.914396284059;5565.193047008162;5567.832965011056;5570.916436253459;5571.526420254243;5574.219609254707;4249.660027197817;4299.591538803808;4310.073334233155;4315.935260971088;4348.456442944632;3817.866374676873;3838.9040273993373;3847.2882516734494;3881.126746482019;3887.6501114899793;5203.479652034766;5235.869103272373;5236.895262094737;5239.842804715865;5295.920561191585;5401.864953376197;5500.4499550044675;5510.366307874566;5632.2678051853;5634.492895639412;5075.619328550373;5191.844244672666;5192.92210616841;5209.713465759344;5212.8957420851375;4809.062232864628;4810.903781924342;4815;4817.807287708522;4827.662063655511;5654;5731.226284451629;5747.770089196469;5761.049426844607;5872.706364681749;5516.062269414289;5519.448055194609;5520.089185284383;5521.5306698931045;5524.088525393265;5644.125160600113;5697.8860422790485;5701;5705.286839145107;5714.885702285847;5360.088784906653;5433.239346491416;5498.230247765396;5567.359753628222;5591.748371323381;5472.781088756406;5530.723463826712;5546.916796247979;5549.972250138723;5559.27729395176;5404.32445944257;5419.376771671308;5426.7829286829665;5427.4301198373605;5476.288082549402;5281.815136470359;5324.8136315228785;5468.507834294774;5528.9723551381985;5570.916436253378;5252.107141785982;5284;5284.9471505284455;5290.100682883996;5338.919916201337;5360.544353729977;5395.325584301962;5399.055165346127;5411.080116380146;5447.863803404788;5282.102042652681;5338.919916201337;5345.893082138257;5369.865753356197;5412 05:56:39 INFO - PROCESS | 15098 | |1;ext.html;525.2305372629097;529.3383270911361;538.3620409814371;553.7618823905719;555.7360253879408;29151.708482915164;29774.55338169929;36683.266334673324;37405;37595.248095038085;39384;40340.39489407654;40361.59638403615;40374.39438408419;40388.59611403885;8429.662813487454;8631.827363452727;8633.309335253196;8635;8637.3521985851;8256.545889976049;8385.83228335433;8388.119247479019;8407.075221725636;8416.873746893802;8606.225439710424;8652.394332396734;8684.522351270678;8687.913120868805;8698.695545655903;8528.360372972022;8556.101609330994;8569.400141990063;8601.655933762642;8621.956890215508;8460.66157353705;8619.70704394346;8623.482591044494;8632.65469381224;8636.870446943301;40624;41022;41093.178136437404;41268.1746365074;41317;3152.3064925716308;3318.4192766266046;3660.3045421369857;3666.7433279670436;3691.8154092295276;30956.226094347596;30990.690093099005;31188;31387.529187062213;32091;3925.214957008581;3977.3039718049513;3988.3020471417676;3993;4043.0903046814233;316658;317576.6484670294;319251;322722;324837.9999999976;56326.43673563294;56625;57198;57339;62140.689296553224;58634.41365586375;58740.7062964691;58787.70606146942;58986;58988.41011589915;13466.192028478323;13734.587962361145;13743.175409475463;13750.449982000808;13759.211302530606;9976;10040.397576145455;10239.232057595711;10318.071373576264;10480.842787358195;20485.38543843687;20709.482262943548;20879;20886.060127294004;20909.686354704692;7699.191584883619;7870.72452464161;7874.881876771853;7979.601019948979;8021.438499304993;914.5153068873508;924.4684306523641;972.2659392158874;1037.6886933919793;1044.9425281609433;29669;29874.551881721793;30691.539626905615;31496.37007259842;32189.356212875613;1004.42747633848;1039.6880935719405;1072.485207100596;1092.3500517192258;1139.4416735799564;14667.266636668124;14928.178950157846;14929.695613965;14978.17620030887;15034.774478382833;301199;304563;304838;305096;305372;56594.717026414604;57169.14246286309;57172;57260;57271;1319.089828018664;1319.0964189530202;1319.4656164253493;1347.077252082307;1348.689801345696;29075.85462072676;30165.547516786828;31025.534616980312;31765;31998.840005799822;51591;52159.21761173661;52324.738376307876;52613.7369313151;52688.73655631851;265158;271668;284837;291264;311648;40065.399019014156;40453.39319910145;40640;40660.79669601633;41346.58653413427;42898.35652465153;42935;43137.56862431335;43208.567914320454;43332.133357332044;36654.8167259162;36778.26443471062;39948.60051399449;41536.584634153274;42011.57988420199;33442.665573343955;37806.00220236892;40052.1989560213;40968.59031409767;41553;34892.65107348894;35360.29279414346;35507.64492355147;38402.42396364113;38467.2306553873;32917.835410822794;34227;34316.82841585776;34855.302893942484;35077.12307192341;25812.555709924418;25937.740622593534;26218;26265;26653.20040398791 05:56:39 INFO - PROCESS | 15098 | |2;jquery.html;369.4617974515082;373.2032111442071;373.36527902565643;374.6796489001905;375.69756346141344;13663.93168034161;13987.300634968262;15579.688406231882;16510.25703843327;17167.141642917868;10833.945830270857;11130.666080017592;16065.919670401661;16433.342666293334;16442.095684737335;3849.4225866120164;4815.807367705296;4946.703197808125;4955.900881982358;4957.231629097478;3937.448757173998;5317.46825317469;5468.425815289377;5491.643043202199;5519.779208831662;5457.645253058558;5489.39616642169;5684.459976302244;6054;6058.909116363258;5772.653640781525;6020.277566692025;6026.035834266519;6044.455998960093;6071.453569178773;5372.2210279509645;5388.622796404254;5392.676439413648;5393.2449457076045;5394.811181608625;13171.934140329333;17103.914480427644;19167.90416047911;19806;19849.503762406057;2085.8852763098025;2088.1751708075376;2158.3417057797365;2162.1135334512933;2182.7708090650412;9505.952470237673;9661.372010819274;9693.321467497279;10390.99626506565;13077.149985250928;1858.962820743591;1866.6546688862604;1877.2866310801808;1884.1992153334777;1898.6392585408728;53598;54726.72636636831;55572.44427555713;56017.71991140059;56333.43666563364;9837.950810245902;10016.54925528353;10082.092611664839;10101.797964040677;10159.136473399696;13003.479860805463;13147.868521314664;13200.603981880558;13216.801747973788;13231.404586793617;6887.586744795329;7023.192332881682;7036.120484939383;7064.258252883476;7082.716691332392;6599.70301336441;6614.173228346457;6648.83377915556;6670.399664030164;6688.933110668831;4041.2725709372594;4226.535081141072;4234.920095375721;4395.406620106245;4535.546445355438;1734.8438640522413;1770.2034084661955;1827.1808007292836;1843.8709290349816;1847;884.38093334666;886.9334799890034;927.958241879117;964.7250533597891;989.351974456732;15695.921520392554;16255.593610159603;16341.26464309109;16572.58568535796;16748.24632891523;871.5467956662627;876.7676565710092;915.66120535401;956.1776871890169;961.0149596663337;9073.77315567116;9506.47714375716;9512.524373781283;9588.280878933969;9697.854532182022;130193;131343.34328328297;131790.34104829415;131913.3404332972;132191.3390433061;61629;63044.369556304766;63875.68062159659;64911.35088649148;66288.6685566569;1106.231169337319;1113.9443027848574;1113.9888601113885;1151.988480115205;1152.706059954723;14236.29311248557;15092.221968395263;15265;15453.304601292744;15499.380024798882;31847;32221.51667724939;33487.33025339528;33544.32911341808;33699.494507582895;43178.78410608052;43561.91095222645;43712;43899;45892.31161532513;7278.126624805057;7332.340089391981;7467.701291948261;7527.774166775005;7546.773596792105;7550.811229719301;9752.658656947257;10037.899621003697;10081.14310283634;10957.06864916491;8525.531095789544;9365.765855853659;9379.202767764544;9586;9752.073553012453;9185.08149185103;9205.447673139633;9265.490398028172;9493.288003399635;9539;7425.665845037094;9096.1813436791;9316.068393160629;9535.427874327563;10115.342502737298;6795.25252222265;7118.679659415442;7151.070360853056;7183.599198156309;7237.588670209258;9440.244780417413;9853.655122070693;10040.548175331982;10154.847677284994;10175 05:56:39 INFO - PROCESS | 15098 | |3;mootools.html;1287.5879718490087;1448.0370553581865;1457.6938842843003;1602.2149146918007;1769.4249368955093;6911.343422374879;7627.771166864996;7774.572398518087;7791.571463569501;7797.142314345431;7640.083190017192;7824.687012519493;7824.921750782491;7827.7260295889655;7832.530048197113;2039.5818857134252;2082.6251274770534;2083.656196727538;2329.8252631052655;2359.634256690207;2348.6477028445697;2385.2844146755992;2386.4033991502124;2387.248016874679;2388.10446082719;2258.446680563264;2279.7492275849645;2305.8270629702756;2308.515211805523;2308.9422764430856;2274.7270327560714;2276.3284830974903;2283.4177284792354;2347.3427440316736;2348.095983046522;2331.1258278145697;2352.6000579901456;2358.4929240213264;2358.870262135582;2366.2782851230368;7827.921720782833;7868.6065696715505;7872.409569282269;7873.055233371975;7877.172896845863;4873.122837889178;4968.105740966625;4984.22744474607;4984.27727979441;4986.301917731521;3052.206426329148;3088.969110308891;3128.9530657039936;3199.616046074486;3297.1921879139522;999.8900120986685;1015.4567306490992;1033.245730616654;1053.1311667873958;1056.9260151789379;10960.342379457257;11003.119750419946;11004;11007.284526505831;11016.614418495314;4454.821807127743;4541.159885421208;4588.059447813191;4595.793189306489;4626.467956185014;9416.717498475056;9419.764505887271;9432.669856554987;9437.339386243035;9448.102430269113;5048.217526283359;5048.949510504848;5049.368828896388;5049.747512624354;5053.267276244924;4556.430446194226;4574.268117101248;4576.473705523841;4584;4590.196715574761;3421.3328400961573;3434.7252219822853;3623.438367053111;3659.798711070917;3708.554973403209;1121.030308782897;1123.5955056179769;1125.1729978465985;1126.983095253572;1152.7694461107812;1038.2732087538752;1059.1262208677717;1061.034458642647;1229.3484453239798;1365.4060483689627;7414;7472.813179670552;7494.887576686354;7518.774436766906;7660.923390766021;1111.155521803419;1119.2445099557929;1127.233481232753;1128.6614015795228;1142.805857627932;5861.912071318934;5953.077273022688;5953.136795164677;5953.851153721192;5957.761689532457;9004.8649270261;9170.770730731785;9173.633054677739;9197;9314.86027709585;9256.444613323221;9269.67556135532;9319.90680093204;9343.766405839773;9351.971283158848;7115.786526404217;7179.784606461814;7384.409247260206;7386.187519372865;7446.292602202782;7242.891356629761;7327.816804579928;7343.44924130703;7348.742794002184;7580.772576822704;8472.068072511895;8485.533295668798;8671.869921951049;8770.12298770118;8805.16350946659;8675.86986195195;8817.955910220664;8818.735437936872;8945.23965462917;8965.686200983195;7425.294597013275;7527.661255243636;7528.811779705551;7533.698652054076;7546.735864244725;6690.230623478362;6855.07456493367;7299.416046716144;7530;7533.209013053551;6945.479089068441;7001.8949715755325;7089.929100708927;7157.713691452492;7173.964130179525;6871.4502839773695;6951.548149370275;7018.298170182941;7044.471664625071;7109;6922.93077069243;7018.613976231152;7060.6116663584;7064.505484616027;7068.964655176691;6502.479801615765;6573.934260657524;6575.4410875076155;6575.605463672195;6583.275839657538;6562.048502967138;6615.933840661532;6622.337766223339;6713.060171576081;6714.462842972453 05:56:39 INFO - PROCESS | 15098 | |4;prototype.html;352.46601398880694;357.973152013599;358.69510915721634;360.62314880949407;367.2141616939748;5816.272965879265;5945.37573554777;5998.310194327648;6003.009503431934;6006.81979540614;5778.913316300248;5882.441168089024;5932.406759324065;5955.821325360235;5957.582969192158;4641.930371044437;4649.070185962821;4654.162250794856;4655.394798676168;4658.208104622214;4438.201123797715;4569.840055598055;4647.860564183063;4656.906861862761;4666.253399456088;4449.710768800034;4514.548545145492;4534.795934182953;4607.654425918053;4619.930701039487;4598.057398233354;4603.930941035904;4604.286335617984;4607.631389488833;4611.100835337111;4080.9387859182134;4091.4476545666253;4092.1201941582403;4094.1197642506704;4097.44684467599;5493.423190564973;5631.380548139701;5634.859128521779;5640.125780503988;5658.094704847204;5377.8117765878005;5380.892382152374;5388.326459192601;5393.2449457076045;5393.703346315951;6283.654399008053;6286.968565157145;6288.308286088527;6288.3397243289255;6289.968550157266;4545.704529205591;4548.8862778430475;4562.1560011398;4566.70316429431;4567.703099298535;6470.57941233823;6597.670116494156;6611.140551728293;6625.304343043959;6636.469082473391;4665.810218394356;4675.929861052087;4681.648876334289;4682.157211701859;4683.180443422388;4487.080148569601;4594.448666160082;4734.668573199911;4737.147313483606;4741.691790033637;5271.235670827785;5365.919511207335;5385.3268341457315;5386.865328366822;5397.568194544506;6391.137196478416;6395.808125756142;6396.840078998062;6398.776042838478;6401.423871851555;1655.1724137931035;1656.9502914912573;1666.6000159961523;1668.607877148869;1676.2624445244053;1124.4995976790249;1139.8347239650204;1143.0398465289031;1151.5048529132387;1173.20808454293;6019.849503762441;6026.126211699279;6026.969865150646;6027.397260274025;6031.517478601701;6500.674966251669;6518.120053792677;6531.804045878631;6535.934640653532;6540.70566824494;5891.882162356729;6020.307664618625;6026.638401695912;6030.276366836008;6032.788852390233;3506.3513250048823;3534.8939531814085;3538.133157376408;3538.168530395355;3539.1152211947015;6815;6827.897581536281;6834.2482326944;6839.076724642109;6840.931590684029;6549.312322206195;6700;6704.497162712719;6705.631190284581;6710.899336509956;6813.2846051163915;6817.488688348294;6826.180858297036;6832.180138383425;6836.965815170992;6533.3339998300125;6540.869182616416;6553.311902250195;6558;6563.803085907431;6327.810165695037;6452.774152904626;6460.741570337322;6473.093766872736;6478.384553467413;6820.556663816836;6822.079019332326;6829.795106146824;6840.965795170992;6849.2808255132495;4680.672352935262;4681.133990211822;4682.765861706833;4694.812207511798;4702.670813043054;6355.586886852339;6502.739890404331;6521.315261897622;6538.901916471352;6545.967270163809;6433.903491447539;6451.935480645134;6456;6466.288708241996;6469.159009328757;6433.774817881352;6436.549441539048;6441;6506;6509.023646452881;6111.449969502766;6283.3402492737605;6317.7157027932935;6318.399752023551;6353.777617783356;6493.123428337114;6506.4469520091325;6507.609543427409;6512;6512.804615861532;6320.462760665211;6324.209473815773;6325.240971083499;6326.272478664829;6330.746770129327 05:56:39 INFO - PROCESS | 15098 | |5;yui.html;761.5126319155742;804.556182860875;839.6046695548805;851.5316575883263;861.0915484164204;12915.483380664773;13006.284654344006;13058.151220170683;13061.41223644936;13072.150310229828;11995.280283183016;12044.57843975461;12060.51757929684;12064.276143431378;12066.517339306418;661.0183876942737;677.793273051719;680.5372346804171;680.5780416141998;680.8434060166164;812.10262659761;817.7056259746487;822.0833770346051;824.7608193623872;825.7151282807422;853.8676505141713;868.0408148995364;868.8870446841902;869.1656010230155;869.5391442535466;689.4794430205188;700.7337211859511;837.2339309531772;854.5855260198798;856.5331894117721;631.1447987976318;631.277187620177;632.0866348126958;632.8133200705756;633.7179954920063;12203.389830508439;12249.877501224963;12270.509179632803;12292.877071229263;12305.507779688802;12007.57973470933;12257.938710306391;12518.874811251953;12744.553940612126;13019.153755005895;9967.252456065824;10030.699079027641;10187.643432479901;10253.79492410155;10496.265261431703;3448.741344399155;3455.2571197192474;3501.457274122515;3691.9261614767556;3695.833687484043;46479;46566.301505477444;46632.53367466316;46819.53180468186;46855.29717054213;10157.085862272432;10180.727409073867;10301.896981030244;10437.32157409766;10731.409772462433;18500.814991850177;18503.629927401376;18506.81493185051;18525.166367513495;18533.07334633263;7264.600446975362;7293.635318234067;7357.52176108562;7521.962390188123;7596.08846938371;4285.61429471349;4326.394304797331;4338;4343.652507799432;4348.173846969065;3086.5215891536845;3131.984340078285;3136.2159460134967;3138.9686103139134;3140.4190224808485;553.4741995104666;555.4528789142691;561.7894032845311;567.8410045187354;582.8863371642574;504.29650637360675;543.114723001505;547.6604505206798;597.7961842163952;643.8036398898288;8497.405181637227;9235.630574777068;9416.670416535388;9540.713778586654;9611.134997850228;503.8337348675002;575.8549403472033;637.5059329019954;709.8890236779424;743.7657138001513;3994.3009973254566;4026.879193624196;4054.5742697016976;4322.459692538433;4598.402207713043;55258;56653.716731416076;57776.42223577711;57827.71086144543;58157;50080.749596251786;50596.49403505918;50823.49176508262;50836.74581627068;51239.975200495785;46998;47200.29199562009;47662.76168619135;47981;48043.03913921772;9019.729408117766;9064.592093355946;9146.451212927246;9438.716838494856;9490.620375184915;35739.28521429609;36192.27615447624;36708.632913670524;36775.26449471049;36859.44710829286;42515.149697006505;42597.5740242606;46174.769126154155;46331;46944.53055469538;11526.94236528812;11538.88461115378;11928.522859085539;11980.101492387932;12219.69450763738;12474.313912734524;12516.436760345989;12597.685057873627;12616.936915315364;13158.671033224246;11343.829842552203;11415.885841141482;11852.34812085309;12001.339926304137;12469.688257793265;11725.589604364148;12086.214396064228;12103;12336;12684.492620295085;7696.384289256958;10333;11688.064954803425;11737.941310293394;12133.150679452707;9193.310501712265;9626.133647971716;9826.16477599412;10061.89938100639;10251.538680759235;8393.83212335762;9483.193928515877;9728.75678108053;9814.263930205121;10323.174146068146 05:56:39 INFO - PROCESS | 15098 | __end_tp_report 05:56:39 INFO - PROCESS | 15098 | __start_cc_report 05:56:39 INFO - PROCESS | 15098 | _x_x_mozilla_cycle_collect,951 05:56:39 INFO - PROCESS | 15098 | __end_cc_report 05:56:39 INFO - PROCESS | 15098 | __startTimestamp1453643799809__endTimestamp 05:56:39 INFO - PROCESS | 15098 | 05:56:39 INFO - PROCESS | 15098 | ------- Summary: start ------- 05:56:39 INFO - PROCESS | 15098 | Number of tests: 6 05:56:39 INFO - PROCESS | 15098 | 05:56:39 INFO - PROCESS | 15098 | [#0] dojo.html Cycles:165 Average:5161.94 Median:5338.92 stddev:558.61 (10.5%) stddev-sans-first:536.53 05:56:39 INFO - PROCESS | 15098 | Values: 3106.0 3125.9 3131.6 3134.4 3164.2 5045.2 5151.8 5202.5 5234.6 5269.2 5052.4 5137.9 5232.9 5242.2 5243.3 4718.0 4750.0 4750.7 4778.3 4805.6 4416.0 4786.3 4846.5 4864.2 4902.0 4664.9 4729.7 4806.4 4841.2 4846.5 4656.6 4665.0 4730.1 4805.1 4818.7 4719.6 4728.0 4729.9 4736.9 4757.2 5022.0 5070.7 5079.4 5093.6 5134.6 5453.8 5509.7 5527.5 5564.7 5611.0 5543.9 5557.2 5558.0 5562.0 5563.9 5034.5 5208.9 5213.4 5214.2 5217.9 5588.0 5606.9 5650.3 5657.5 5708.5 5519.4 5522.1 5525.8 5531.0 5534.6 5387.8 5590.8 5606.4 5607.1 5610.4 5424.1 5598.3 5635.6 5655.2 5706.9 5565.2 5567.8 5570.9 5571.5 5574.2 4249.7 4299.6 4310.1 4315.9 4348.5 3817.9 3838.9 3847.3 3881.1 3887.7 5203.5 5235.9 5236.9 5239.8 5295.9 5401.9 5500.4 5510.4 5632.3 5634.5 5075.6 5191.8 5192.9 5209.7 5212.9 4809.1 4810.9 4815.0 4817.8 4827.7 5654.0 5731.2 5747.8 5761.0 5872.7 5516.1 5519.4 5520.1 5521.5 5524.1 5644.1 5697.9 5701.0 5705.3 5714.9 5360.1 5433.2 5498.2 5567.4 5591.7 5472.8 5530.7 5546.9 5550.0 5559.3 5404.3 5419.4 5426.8 5427.4 5476.3 5281.8 5324.8 5468.5 5529.0 5570.9 5252.1 5284.0 5284.9 5290.1 5338.9 5360.5 5395.3 5399.1 5411.1 5447.9 5282.1 5338.9 5345.9 5369.9 5412.0 05:56:39 INFO - PROCESS | 15098 | 05:56:39 INFO - PROCESS | 15098 | [#1] ext.html Cycles:180 Average:47896.48 Median:21654.61 stddev:79330.18 (366.3%) stddev-sans-first:79472.99 05:56:39 INFO - PROCESS | 15098 | Values: 525.2 529.3 538.4 553.8 555.7 29151.7 29774.6 36683.3 37405.0 37595.2 39384.0 40340.4 40361.6 40374.4 40388.6 8429.7 8631.8 8633.3 8635.0 8637.4 8256.5 8385.8 8388.1 8407.1 8416.9 8606.2 8652.4 8684.5 8687.9 8698.7 8528.4 8556.1 8569.4 8601.7 8622.0 8460.7 8619.7 8623.5 8632.7 8636.9 40624.0 41022.0 41093.2 41268.2 41317.0 3152.3 3318.4 3660.3 3666.7 3691.8 30956.2 30990.7 31188.0 31387.5 32091.0 3925.2 3977.3 3988.3 3993.0 4043.1 316658.0 317576.6 319251.0 322722.0 324838.0 56326.4 56625.0 57198.0 57339.0 62140.7 58634.4 58740.7 58787.7 58986.0 58988.4 13466.2 13734.6 13743.2 13750.4 13759.2 9976.0 10040.4 10239.2 10318.1 10480.8 20485.4 20709.5 20879.0 20886.1 20909.7 7699.2 7870.7 7874.9 7979.6 8021.4 914.5 924.5 972.3 1037.7 1044.9 29669.0 29874.6 30691.5 31496.4 32189.4 1004.4 1039.7 1072.5 1092.4 1139.4 14667.3 14928.2 14929.7 14978.2 15034.8 301199.0 304563.0 304838.0 305096.0 305372.0 56594.7 57169.1 57172.0 57260.0 57271.0 1319.1 1319.1 1319.5 1347.1 1348.7 29075.9 30165.5 31025.5 31765.0 31998.8 51591.0 52159.2 52324.7 52613.7 52688.7 265158.0 271668.0 284837.0 291264.0 311648.0 40065.4 40453.4 40640.0 40660.8 41346.6 42898.4 42935.0 43137.6 43208.6 43332.1 36654.8 36778.3 39948.6 41536.6 42011.6 33442.7 37806.0 40052.2 40968.6 41553.0 34892.7 35360.3 35507.6 38402.4 38467.2 32917.8 34227.0 34316.8 34855.3 35077.1 25812.6 25937.7 26218.0 26265.0 26653.2 05:56:39 INFO - PROCESS | 15098 | 05:56:39 INFO - PROCESS | 15098 | [#2] jquery.html Cycles:180 Average:15712.09 Median:4881.26 stddev:24304.17 (497.9%) stddev-sans-first:24345.04 05:56:39 INFO - PROCESS | 15098 | Values: 369.5 373.2 373.4 374.7 375.7 13663.9 13987.3 15579.7 16510.3 17167.1 10833.9 11130.7 16065.9 16433.3 16442.1 3849.4 4815.8 4946.7 4955.9 4957.2 3937.4 5317.5 5468.4 5491.6 5519.8 5457.6 5489.4 5684.5 6054.0 6058.9 5772.7 6020.3 6026.0 6044.5 6071.5 5372.2 5388.6 5392.7 5393.2 5394.8 13171.9 17103.9 19167.9 19806.0 19849.5 2085.9 2088.2 2158.3 2162.1 2182.8 9506.0 9661.4 9693.3 10391.0 13077.1 1859.0 1866.7 1877.3 1884.2 1898.6 53598.0 54726.7 55572.4 56017.7 56333.4 9838.0 10016.5 10082.1 10101.8 10159.1 13003.5 13147.9 13200.6 13216.8 13231.4 6887.6 7023.2 7036.1 7064.3 7082.7 6599.7 6614.2 6648.8 6670.4 6688.9 4041.3 4226.5 4234.9 4395.4 4535.5 1734.8 1770.2 1827.2 1843.9 1847.0 884.4 886.9 928.0 964.7 989.4 15695.9 16255.6 16341.3 16572.6 16748.2 871.5 876.8 915.7 956.2 961.0 9073.8 9506.5 9512.5 9588.3 9697.9 130193.0 131343.3 131790.3 131913.3 132191.3 61629.0 63044.4 63875.7 64911.4 66288.7 1106.2 1113.9 1114.0 1152.0 1152.7 14236.3 15092.2 15265.0 15453.3 15499.4 31847.0 32221.5 33487.3 33544.3 33699.5 43178.8 43561.9 43712.0 43899.0 45892.3 7278.1 7332.3 7467.7 7527.8 7546.8 7550.8 9752.7 10037.9 10081.1 10957.1 8525.5 9365.8 9379.2 9586.0 9752.1 9185.1 9205.4 9265.5 9493.3 9539.0 7425.7 9096.2 9316.1 9535.4 10115.3 6795.3 7118.7 7151.1 7183.6 7237.6 9440.2 9853.7 10040.5 10154.8 10175.0 05:56:39 INFO - PROCESS | 15098 | 05:56:39 INFO - PROCESS | 15098 | [#3] mootools.html Cycles:180 Average:5557.82 Median:6567.99 stddev:2861.76 (43.6%) stddev-sans-first:2851.78 05:56:39 INFO - PROCESS | 15098 | Values: 1287.6 1448.0 1457.7 1602.2 1769.4 6911.3 7627.8 7774.6 7791.6 7797.1 7640.1 7824.7 7824.9 7827.7 7832.5 2039.6 2082.6 2083.7 2329.8 2359.6 2348.6 2385.3 2386.4 2387.2 2388.1 2258.4 2279.7 2305.8 2308.5 2308.9 2274.7 2276.3 2283.4 2347.3 2348.1 2331.1 2352.6 2358.5 2358.9 2366.3 7827.9 7868.6 7872.4 7873.1 7877.2 4873.1 4968.1 4984.2 4984.3 4986.3 3052.2 3089.0 3129.0 3199.6 3297.2 999.9 1015.5 1033.2 1053.1 1056.9 10960.3 11003.1 11004.0 11007.3 11016.6 4454.8 4541.2 4588.1 4595.8 4626.5 9416.7 9419.8 9432.7 9437.3 9448.1 5048.2 5048.9 5049.4 5049.7 5053.3 4556.4 4574.3 4576.5 4584.0 4590.2 3421.3 3434.7 3623.4 3659.8 3708.6 1121.0 1123.6 1125.2 1127.0 1152.8 1038.3 1059.1 1061.0 1229.3 1365.4 7414.0 7472.8 7494.9 7518.8 7660.9 1111.2 1119.2 1127.2 1128.7 1142.8 5861.9 5953.1 5953.1 5953.9 5957.8 9004.9 9170.8 9173.6 9197.0 9314.9 9256.4 9269.7 9319.9 9343.8 9352.0 7115.8 7179.8 7384.4 7386.2 7446.3 7242.9 7327.8 7343.4 7348.7 7580.8 8472.1 8485.5 8671.9 8770.1 8805.2 8675.9 8818.0 8818.7 8945.2 8965.7 7425.3 7527.7 7528.8 7533.7 7546.7 6690.2 6855.1 7299.4 7530.0 7533.2 6945.5 7001.9 7089.9 7157.7 7174.0 6871.5 6951.5 7018.3 7044.5 7109.0 6922.9 7018.6 7060.6 7064.5 7069.0 6502.5 6573.9 6575.4 6575.6 6583.3 6562.0 6615.9 6622.3 6713.1 6714.5 05:56:39 INFO - PROCESS | 15098 | 05:56:39 INFO - PROCESS | 15098 | [#4] prototype.html Cycles:180 Average:5346.89 Median:6013.33 stddev:1583.29 (26.3%) stddev-sans-first:1542.71 05:56:39 INFO - PROCESS | 15098 | Values: 352.5 358.0 358.7 360.6 367.2 5816.3 5945.4 5998.3 6003.0 6006.8 5778.9 5882.4 5932.4 5955.8 5957.6 4641.9 4649.1 4654.2 4655.4 4658.2 4438.2 4569.8 4647.9 4656.9 4666.3 4449.7 4514.5 4534.8 4607.7 4619.9 4598.1 4603.9 4604.3 4607.6 4611.1 4080.9 4091.4 4092.1 4094.1 4097.4 5493.4 5631.4 5634.9 5640.1 5658.1 5377.8 5380.9 5388.3 5393.2 5393.7 6283.7 6287.0 6288.3 6288.3 6290.0 4545.7 4548.9 4562.2 4566.7 4567.7 6470.6 6597.7 6611.1 6625.3 6636.5 4665.8 4675.9 4681.6 4682.2 4683.2 4487.1 4594.4 4734.7 4737.1 4741.7 5271.2 5365.9 5385.3 5386.9 5397.6 6391.1 6395.8 6396.8 6398.8 6401.4 1655.2 1657.0 1666.6 1668.6 1676.3 1124.5 1139.8 1143.0 1151.5 1173.2 6019.8 6026.1 6027.0 6027.4 6031.5 6500.7 6518.1 6531.8 6535.9 6540.7 5891.9 6020.3 6026.6 6030.3 6032.8 3506.4 3534.9 3538.1 3538.2 3539.1 6815.0 6827.9 6834.2 6839.1 6840.9 6549.3 6700.0 6704.5 6705.6 6710.9 6813.3 6817.5 6826.2 6832.2 6837.0 6533.3 6540.9 6553.3 6558.0 6563.8 6327.8 6452.8 6460.7 6473.1 6478.4 6820.6 6822.1 6829.8 6841.0 6849.3 4680.7 4681.1 4682.8 4694.8 4702.7 6355.6 6502.7 6521.3 6538.9 6546.0 6433.9 6451.9 6456.0 6466.3 6469.2 6433.8 6436.5 6441.0 6506.0 6509.0 6111.4 6283.3 6317.7 6318.4 6353.8 6493.1 6506.4 6507.6 6512.0 6512.8 6320.5 6324.2 6325.2 6326.3 6330.7 05:56:39 INFO - PROCESS | 15098 | 05:56:39 INFO - PROCESS | 15098 | [#5] yui.html Cycles:180 Average:13845.24 Median:46522.65 stddev:15933.30 (34.2%) stddev-sans-first:15947.70 05:56:39 INFO - PROCESS | 15098 | Values: 761.5 804.6 839.6 851.5 861.1 12915.5 13006.3 13058.2 13061.4 13072.2 11995.3 12044.6 12060.5 12064.3 12066.5 661.0 677.8 680.5 680.6 680.8 812.1 817.7 822.1 824.8 825.7 853.9 868.0 868.9 869.2 869.5 689.5 700.7 837.2 854.6 856.5 631.1 631.3 632.1 632.8 633.7 12203.4 12249.9 12270.5 12292.9 12305.5 12007.6 12257.9 12518.9 12744.6 13019.2 9967.3 10030.7 10187.6 10253.8 10496.3 3448.7 3455.3 3501.5 3691.9 3695.8 46479.0 46566.3 46632.5 46819.5 46855.3 10157.1 10180.7 10301.9 10437.3 10731.4 18500.8 18503.6 18506.8 18525.2 18533.1 7264.6 7293.6 7357.5 7522.0 7596.1 4285.6 4326.4 4338.0 4343.7 4348.2 3086.5 3132.0 3136.2 3139.0 3140.4 553.5 555.5 561.8 567.8 582.9 504.3 543.1 547.7 597.8 643.8 8497.4 9235.6 9416.7 9540.7 9611.1 503.8 575.9 637.5 709.9 743.8 3994.3 4026.9 4054.6 4322.5 4598.4 55258.0 56653.7 57776.4 57827.7 58157.0 50080.7 50596.5 50823.5 50836.7 51240.0 46998.0 47200.3 47662.8 47981.0 48043.0 9019.7 9064.6 9146.5 9438.7 9490.6 35739.3 36192.3 36708.6 36775.3 36859.4 42515.1 42597.6 46174.8 46331.0 46944.5 11526.9 11538.9 11928.5 11980.1 12219.7 12474.3 12516.4 12597.7 12616.9 13158.7 11343.8 11415.9 11852.3 12001.3 12469.7 11725.6 12086.2 12103.0 12336.0 12684.5 7696.4 10333.0 11688.1 11737.9 12133.2 9193.3 9626.1 9826.2 10061.9 10251.5 8393.8 9483.2 9728.8 9814.3 10323.2 05:56:39 INFO - PROCESS | 15098 | -------- Summary: end -------- 05:56:39 INFO - PROCESS | 15098 | 05:56:40 INFO - TEST-INFO | 15098: exit 0 05:56:40 INFO - TEST-OK | dromaeo_css | took 1112865ms 05:56:40 INFO - TEST-START | kraken 05:56:40 INFO - operating with platform_type : linux_ 05:56:40 INFO - Initialising browser for kraken test... 05:56:40 INFO - TEST-INFO | started process 15296 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp0VK_5I/profile http://localhost:54682/getInfo.html) 05:56:44 INFO - PROCESS | 15296 | __metrics Screen width/height:1600/1200 05:56:44 INFO - PROCESS | 15296 | colorDepth:24 05:56:44 INFO - PROCESS | 15296 | Browser inner width/height: 1024/697 05:56:44 INFO - PROCESS | 15296 | __metrics 05:56:44 INFO - PROCESS | 15296 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 05:56:44 INFO - PROCESS | 15296 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:56:45 INFO - TEST-INFO | 15296: exit 0 05:56:45 INFO - Browser initialized. 05:56:45 INFO - Running cycle 1/1 for kraken test... 05:56:45 INFO - TEST-INFO | started process 15377 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp0VK_5I/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:56:57 INFO - PROCESS | 15377 | RSS: Main: 148467712 05:56:57 INFO - PROCESS | 15377 | 05:56:59 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54682/tests/kraken/driver.html?testName=audio-beat-detection) 05:57:00 INFO - PROCESS | 15377 | RSS: Main: 189325312 05:57:00 INFO - PROCESS | 15377 | 05:57:03 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54682/tests/kraken/driver.html?testName=audio-dft) 05:57:03 INFO - PROCESS | 15377 | RSS: Main: 178970624 05:57:03 INFO - PROCESS | 15377 | 05:57:06 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54682/tests/kraken/driver.html?testName=audio-fft) 05:57:07 INFO - PROCESS | 15377 | RSS: Main: 163815424 05:57:07 INFO - PROCESS | 15377 | 05:57:08 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54682/tests/kraken/driver.html?testName=audio-oscillator) 05:57:09 INFO - PROCESS | 15377 | RSS: Main: 166932480 05:57:09 INFO - PROCESS | 15377 | 05:57:11 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54682/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:57:12 INFO - PROCESS | 15377 | RSS: Main: 167706624 05:57:12 INFO - PROCESS | 15377 | 05:57:15 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54682/tests/kraken/driver.html?testName=imaging-darkroom) 05:57:15 INFO - PROCESS | 15377 | RSS: Main: 167391232 05:57:15 INFO - PROCESS | 15377 | 05:57:19 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54682/tests/kraken/driver.html?testName=imaging-desaturate) 05:57:19 INFO - PROCESS | 15377 | RSS: Main: 167718912 05:57:19 INFO - PROCESS | 15377 | 05:57:22 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54682/tests/kraken/driver.html?testName=json-parse-financial) 05:57:23 INFO - PROCESS | 15377 | RSS: Main: 169418752 05:57:23 INFO - PROCESS | 15377 | 05:57:24 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54682/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:57:25 INFO - PROCESS | 15377 | RSS: Main: 177115136 05:57:25 INFO - PROCESS | 15377 | 05:57:27 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54682/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:57:27 INFO - PROCESS | 15377 | RSS: Main: 177176576 05:57:27 INFO - PROCESS | 15377 | 05:57:29 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54682/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:57:30 INFO - PROCESS | 15377 | RSS: Main: 182259712 05:57:30 INFO - PROCESS | 15377 | 05:57:32 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54682/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:57:33 INFO - PROCESS | 15377 | RSS: Main: 190369792 05:57:33 INFO - PROCESS | 15377 | 05:57:35 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54682/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:57:36 INFO - PROCESS | 15377 | RSS: Main: 190349312 05:57:36 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | Cycle 1(1): loaded http://localhost:54682/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54682/tests/kraken/driver.html?testName=ai-astar) 05:57:38 INFO - PROCESS | 15377 | RSS: Main: 249757696 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | __start_tp_report 05:57:38 INFO - PROCESS | 15377 | _x_x_mozilla_page_load 05:57:38 INFO - PROCESS | 15377 | _x_x_mozilla_page_load_details 05:57:38 INFO - PROCESS | 15377 | |i|pagename|runs| 05:57:38 INFO - PROCESS | 15377 | |0;ai-astar;111;109;107;108;111;111;111;110;102;109 05:57:38 INFO - PROCESS | 15377 | |1;audio-beat-detection;154;128;153;165;126;162;153;132;165;125 05:57:38 INFO - PROCESS | 15377 | |2;audio-dft;162;159;161;160;161;160;160;161;162;161 05:57:38 INFO - PROCESS | 15377 | |3;audio-fft;73;72;107;91;75;73;73;113;95;75 05:57:38 INFO - PROCESS | 15377 | |4;audio-oscillator;97;97;140;96;96;98;142;97;98;151 05:57:38 INFO - PROCESS | 15377 | |5;imaging-gaussian-blur;109;109;109;109;109;109;109;108;110;109 05:57:38 INFO - PROCESS | 15377 | |6;imaging-darkroom;146;145;145;145;146;145;146;145;145;145 05:57:38 INFO - PROCESS | 15377 | |7;imaging-desaturate;96;96;96;96;96;95;96;96;95;96 05:57:38 INFO - PROCESS | 15377 | |8;json-parse-financial;55;56;55;55;55;56;56;56;56;53 05:57:38 INFO - PROCESS | 15377 | |9;json-stringify-tinderbox;67;67;68;67;68;68;67;67;67;67 05:57:38 INFO - PROCESS | 15377 | |10;stanford-crypto-aes;80;81;82;81;85;81;90;82;90;84 05:57:38 INFO - PROCESS | 15377 | |11;stanford-crypto-ccm;112;115;127;131;125;124;115;114;114;124 05:57:38 INFO - PROCESS | 15377 | |12;stanford-crypto-pbkdf2;142;137;141;143;141;129;142;132;132;139 05:57:38 INFO - PROCESS | 15377 | |13;stanford-crypto-sha256-iterative;67;66;66;65;67;64;65;66;67;65 05:57:38 INFO - PROCESS | 15377 | __end_tp_report 05:57:38 INFO - PROCESS | 15377 | __start_cc_report 05:57:38 INFO - PROCESS | 15377 | _x_x_mozilla_cycle_collect,948 05:57:38 INFO - PROCESS | 15377 | __end_cc_report 05:57:38 INFO - PROCESS | 15377 | __startTimestamp1453643858341__endTimestamp 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | ------- Summary: start ------- 05:57:38 INFO - PROCESS | 15377 | Number of tests: 14 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#0] ai-astar Cycles:10 Average:108.90 Median:110.50 stddev:2.81 (2.5%) stddev-sans-first:2.87 05:57:38 INFO - PROCESS | 15377 | Values: 111.0 109.0 107.0 108.0 111.0 111.0 111.0 110.0 102.0 109.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#1] audio-beat-detection Cycles:10 Average:146.30 Median:153.50 stddev:16.67 (10.9%) stddev-sans-first:17.44 05:57:38 INFO - PROCESS | 15377 | Values: 154.0 128.0 153.0 165.0 126.0 162.0 153.0 132.0 165.0 125.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#2] audio-dft Cycles:10 Average:160.70 Median:161.00 stddev:0.95 (0.6%) stddev-sans-first:0.88 05:57:38 INFO - PROCESS | 15377 | Values: 162.0 159.0 161.0 160.0 161.0 160.0 160.0 161.0 162.0 161.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#3] audio-fft Cycles:10 Average:84.70 Median:74.00 stddev:15.65 (21.1%) stddev-sans-first:16.02 05:57:38 INFO - PROCESS | 15377 | Values: 73.0 72.0 107.0 91.0 75.0 73.0 73.0 113.0 95.0 75.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#4] audio-oscillator Cycles:10 Average:111.20 Median:97.00 stddev:23.04 (23.8%) stddev-sans-first:23.86 05:57:38 INFO - PROCESS | 15377 | Values: 97.0 97.0 140.0 96.0 96.0 98.0 142.0 97.0 98.0 151.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#5] imaging-gaussian-blur Cycles:10 Average:109.00 Median:109.00 stddev:0.47 (0.4%) stddev-sans-first:0.50 05:57:38 INFO - PROCESS | 15377 | Values: 109.0 109.0 109.0 109.0 109.0 109.0 109.0 108.0 110.0 109.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#6] imaging-darkroom Cycles:10 Average:145.30 Median:145.00 stddev:0.48 (0.3%) stddev-sans-first:0.44 05:57:38 INFO - PROCESS | 15377 | Values: 146.0 145.0 145.0 145.0 146.0 145.0 146.0 145.0 145.0 145.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:96.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 05:57:38 INFO - PROCESS | 15377 | Values: 96.0 96.0 96.0 96.0 96.0 95.0 96.0 96.0 95.0 96.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#8] json-parse-financial Cycles:10 Average:55.30 Median:56.00 stddev:0.95 (1.7%) stddev-sans-first:1.00 05:57:38 INFO - PROCESS | 15377 | Values: 55.0 56.0 55.0 55.0 55.0 56.0 56.0 56.0 56.0 53.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#9] json-stringify-tinderbox Cycles:10 Average:67.30 Median:67.00 stddev:0.48 (0.7%) stddev-sans-first:0.50 05:57:38 INFO - PROCESS | 15377 | Values: 67.0 67.0 68.0 67.0 68.0 68.0 67.0 67.0 67.0 67.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#10] stanford-crypto-aes Cycles:10 Average:83.60 Median:83.00 stddev:3.69 (4.4%) stddev-sans-first:3.67 05:57:38 INFO - PROCESS | 15377 | Values: 80.0 81.0 82.0 81.0 85.0 81.0 90.0 82.0 90.0 84.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#11] stanford-crypto-ccm Cycles:10 Average:120.10 Median:124.00 stddev:6.77 (5.5%) stddev-sans-first:6.52 05:57:38 INFO - PROCESS | 15377 | Values: 112.0 115.0 127.0 131.0 125.0 124.0 115.0 114.0 114.0 124.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:137.80 Median:141.00 stddev:5.05 (3.6%) stddev-sans-first:5.12 05:57:38 INFO - PROCESS | 15377 | Values: 142.0 137.0 141.0 143.0 141.0 129.0 142.0 132.0 132.0 139.0 05:57:38 INFO - PROCESS | 15377 | 05:57:38 INFO - PROCESS | 15377 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.80 Median:66.00 stddev:1.03 (1.6%) stddev-sans-first:1.00 05:57:38 INFO - PROCESS | 15377 | Values: 67.0 66.0 66.0 65.0 67.0 64.0 65.0 66.0 67.0 65.0 05:57:38 INFO - PROCESS | 15377 | -------- Summary: end -------- 05:57:38 INFO - PROCESS | 15377 | 05:57:39 INFO - TEST-INFO | 15377: exit 0 05:57:39 INFO - TEST-OK | kraken | took 58786ms 05:57:39 INFO - TEST-START | v8_7 05:57:39 INFO - operating with platform_type : linux_ 05:57:39 INFO - Initialising browser for v8_7 test... 05:57:39 INFO - TEST-INFO | started process 15624 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpvGnxHF/profile http://localhost:54682/getInfo.html) 05:57:42 INFO - PROCESS | 15624 | __metrics Screen width/height:1600/1200 05:57:42 INFO - PROCESS | 15624 | colorDepth:24 05:57:42 INFO - PROCESS | 15624 | Browser inner width/height: 1024/697 05:57:42 INFO - PROCESS | 15624 | __metrics 05:57:42 INFO - PROCESS | 15624 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 05:57:43 INFO - PROCESS | 15624 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:57:44 INFO - TEST-INFO | 15624: exit 0 05:57:44 INFO - Browser initialized. 05:57:44 INFO - Running cycle 1/1 for v8_7 test... 05:57:44 INFO - TEST-INFO | started process 15704 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpvGnxHF/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:57:55 INFO - PROCESS | 15704 | RSS: Main: 148357120 05:57:55 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | Cycle 1(1): loaded http://localhost:54682/tests/v8_7/run.html (next: http://localhost:54682/tests/v8_7/run.html) 05:58:18 INFO - PROCESS | 15704 | RSS: Main: 542437376 05:58:18 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | __start_tp_report 05:58:18 INFO - PROCESS | 15704 | _x_x_mozilla_page_load 05:58:18 INFO - PROCESS | 15704 | _x_x_mozilla_page_load_details 05:58:18 INFO - PROCESS | 15704 | |i|pagename|runs| 05:58:18 INFO - PROCESS | 15704 | |0;Richards;166.6944490748458 05:58:18 INFO - PROCESS | 15704 | |1;DeltaBlue;193.53590090961873 05:58:18 INFO - PROCESS | 15704 | |2;Encrypt;280.50490883590464 05:58:18 INFO - PROCESS | 15704 | |3;Decrypt;5256.544502617801 05:58:18 INFO - PROCESS | 15704 | |4;RayTrace;1114.8272017837235 05:58:18 INFO - PROCESS | 15704 | |5;Earley;771.604938271605 05:58:18 INFO - PROCESS | 15704 | |6;Boyer;12195.121951219513 05:58:18 INFO - PROCESS | 15704 | |7;RegExp;42604.166666666664 05:58:18 INFO - PROCESS | 15704 | |8;Splay;568.5048322910744 05:58:18 INFO - PROCESS | 15704 | |9;NavierStokes;4817.307692307692 05:58:18 INFO - PROCESS | 15704 | __end_tp_report 05:58:18 INFO - PROCESS | 15704 | __startTimestamp1453643898513__endTimestamp 05:58:18 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | ------- Summary: start ------- 05:58:18 INFO - PROCESS | 15704 | Number of tests: 10 05:58:18 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | [#0] Richards Cycles:1 Average:166.69 Median:166.69 stddev:0.00 (0.0%) 05:58:18 INFO - PROCESS | 15704 | Values: 166.7 05:58:18 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | [#1] DeltaBlue Cycles:1 Average:193.54 Median:193.54 stddev:0.00 (0.0%) 05:58:18 INFO - PROCESS | 15704 | Values: 193.5 05:58:18 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | [#2] Encrypt Cycles:1 Average:280.50 Median:280.50 stddev:0.00 (0.0%) 05:58:18 INFO - PROCESS | 15704 | Values: 280.5 05:58:18 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | [#3] Decrypt Cycles:1 Average:5256.54 Median:5256.54 stddev:0.00 (0.0%) 05:58:18 INFO - PROCESS | 15704 | Values: 5256.5 05:58:18 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | [#4] RayTrace Cycles:1 Average:1114.83 Median:1114.83 stddev:0.00 (0.0%) 05:58:18 INFO - PROCESS | 15704 | Values: 1114.8 05:58:18 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | [#5] Earley Cycles:1 Average:771.60 Median:771.60 stddev:0.00 (0.0%) 05:58:18 INFO - PROCESS | 15704 | Values: 771.6 05:58:18 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | [#6] Boyer Cycles:1 Average:12195.12 Median:12195.12 stddev:0.00 (0.0%) 05:58:18 INFO - PROCESS | 15704 | Values: 12195.1 05:58:18 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | [#7] RegExp Cycles:1 Average:42604.17 Median:42604.17 stddev:0.00 (0.0%) 05:58:18 INFO - PROCESS | 15704 | Values: 42604.2 05:58:18 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | [#8] Splay Cycles:1 Average:568.50 Median:568.50 stddev:0.00 (0.0%) 05:58:18 INFO - PROCESS | 15704 | Values: 568.5 05:58:18 INFO - PROCESS | 15704 | 05:58:18 INFO - PROCESS | 15704 | [#9] NavierStokes Cycles:1 Average:4817.31 Median:4817.31 stddev:0.00 (0.0%) 05:58:18 INFO - PROCESS | 15704 | Values: 4817.3 05:58:18 INFO - PROCESS | 15704 | -------- Summary: end -------- 05:58:18 INFO - PROCESS | 15704 | 05:58:19 INFO - TEST-INFO | 15704: exit 0 05:58:19 INFO - TEST-OK | v8_7 | took 40100ms 05:58:19 INFO - SUITE-END | took 1211s 05:58:19 INFO - Completed test suite (00:20:11) 05:58:19 INFO - Working with test: dromaeo_css 05:58:19 INFO - Generating results file: dromaeo_css 05:58:19 INFO - Working with test: kraken 05:58:19 INFO - Generating results file: kraken 05:58:19 INFO - javascript benchmark 05:58:19 INFO - Working with test: v8_7 05:58:19 INFO - Generating results file: v8_7 05:58:19 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:58:19 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,1,35]] 05:58:19 INFO - process_Request line: dromaeo_css 6844.38 graph.html#tests=[[72,1,35]] 05:58:19 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:58:19 INFO - process_Request line: kraken 1491.80 graph.html#tests=[[232,1,35]] 05:58:19 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:58:19 INFO - process_Request line: v8_7 20119.84 graph.html#tests=[[230,1,35]] 05:58:19 INFO - RETURN: dromaeo_css: 6844.38 05:58:19 INFO - RETURN: kraken: 1491.80 05:58:19 INFO - RETURN: v8_7: 20119.84 05:58:19 INFO - javascript benchmark 05:58:19 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3105.953410698839, 3125.8749650014, 3131.5772370729946, 3134.3574567213723, 3164.193130751659, 5045.217991211359, 5151.76817043233, 5202.505761952613, 5234.581233501315, 5269.18327659213, 5052.393712754465, 5137.897242055156, 5232.8691782705455, 5242.21366794981, 5243.265942768006, 4718.009218064202, 4749.952500474986, 4750.667453278272, 4778.331033655291, 4805.639577031719, 4416.0, 4786.282057691339, 4846.466888642264, 4864.221724524077, 4902.044101400228, 4664.930026049612, 4729.716217026955, 4806.375171227718, 4841.15279826029, 4846.539578740014, 4656.580907718288, 4665.0, 4730.148573256813, 4805.135075686375, 4818.710877347336, 4719.646026547988, 4727.95272047282, 4729.905401891977, 4736.928946065812, 4757.167495688241, 5022.0, 5070.670406423571, 5079.390473143209, 5093.567046800989, 5134.614903882224, 5453.836384908459, 5509.696966666832, 5527.50252477275, 5564.749586268627, 5611.0, 5543.8891222175735, 5557.221988921554, 5557.972210138963, 5562.0266453370905, 5563.888722225533, 5034.546890779848, 5208.947910520884, 5213.426523082496, 5214.165733482662, 5217.921731174036, 5587.972060139673, 5606.915896261559, 5650.26546548946, 5657.547396208293, 5708.457696518824, 5519.39286678465, 5522.144067669437, 5525.778968841281, 5531.0, 5534.557235421237, 5387.757550910218, 5590.832275031756, 5606.439356064442, 5607.074832652648, 5610.354809196913, 5424.1321388577635, 5598.272224610774, 5635.577331700057, 5655.236543066716, 5706.914396284059, 5565.193047008162, 5567.832965011056, 5570.916436253459, 5571.526420254243, 5574.219609254707, 4249.660027197817, 4299.591538803808, 4310.073334233155, 4315.935260971088, 4348.456442944632, 3817.866374676873, 3838.9040273993373, 3847.2882516734494, 3881.126746482019, 3887.6501114899793, 5203.479652034766, 5235.869103272373, 5236.895262094737, 5239.842804715865, 5295.920561191585, 5401.864953376197, 5500.4499550044675, 5510.366307874566, 5632.2678051853, 5634.492895639412, 5075.619328550373, 5191.844244672666, 5192.92210616841, 5209.713465759344, 5212.8957420851375, 4809.062232864628, 4810.903781924342, 4815.0, 4817.807287708522, 4827.662063655511, 5654.0, 5731.226284451629, 5747.770089196469, 5761.049426844607, 5872.706364681749, 5516.062269414289, 5519.448055194609, 5520.089185284383, 5521.5306698931045, 5524.088525393265, 5644.125160600113, 5697.8860422790485, 5701.0, 5705.286839145107, 5714.885702285847, 5360.088784906653, 5433.239346491416, 5498.230247765396, 5567.359753628222, 5591.748371323381, 5472.781088756406, 5530.723463826712, 5546.916796247979, 5549.972250138723, 5559.27729395176, 5404.32445944257, 5419.376771671308, 5426.7829286829665, 5427.4301198373605, 5476.288082549402, 5281.815136470359, 5324.8136315228785, 5468.507834294774, 5528.9723551381985, 5570.916436253378, 5252.107141785982, 5284.0, 5284.9471505284455, 5290.100682883996, 5338.919916201337, 5360.544353729977, 5395.325584301962, 5399.055165346127, 5411.080116380146, 5447.863803404788, 5282.102042652681, 5338.919916201337, 5345.893082138257, 5369.865753356197, 5412.0], "unit": "score", "name": "dojo.html", "value": 5126.761879776237}, {"lowerIsBetter": false, "replicates": [525.2305372629097, 529.3383270911361, 538.3620409814371, 553.7618823905719, 555.7360253879408, 29151.708482915164, 29774.55338169929, 36683.266334673324, 37405.0, 37595.248095038085, 39384.0, 40340.39489407654, 40361.59638403615, 40374.39438408419, 40388.59611403885, 8429.662813487454, 8631.827363452727, 8633.309335253196, 8635.0, 8637.3521985851, 8256.545889976049, 8385.83228335433, 8388.119247479019, 8407.075221725636, 8416.873746893802, 8606.225439710424, 8652.394332396734, 8684.522351270678, 8687.913120868805, 8698.695545655903, 8528.360372972022, 8556.101609330994, 8569.400141990063, 8601.655933762642, 8621.956890215508, 8460.66157353705, 8619.70704394346, 8623.482591044494, 8632.65469381224, 8636.870446943301, 40624.0, 41022.0, 41093.178136437404, 41268.1746365074, 41317.0, 3152.3064925716308, 3318.4192766266046, 3660.3045421369857, 3666.7433279670436, 3691.8154092295276, 30956.226094347596, 30990.690093099005, 31188.0, 31387.529187062213, 32091.0, 3925.214957008581, 3977.3039718049513, 3988.3020471417676, 3993.0, 4043.0903046814233, 316658.0, 317576.6484670294, 319251.0, 322722.0, 324837.9999999976, 56326.43673563294, 56625.0, 57198.0, 57339.0, 62140.689296553224, 58634.41365586375, 58740.7062964691, 58787.70606146942, 58986.0, 58988.41011589915, 13466.192028478323, 13734.587962361145, 13743.175409475463, 13750.449982000808, 13759.211302530606, 9976.0, 10040.397576145455, 10239.232057595711, 10318.071373576264, 10480.842787358195, 20485.38543843687, 20709.482262943548, 20879.0, 20886.060127294004, 20909.686354704692, 7699.191584883619, 7870.72452464161, 7874.881876771853, 7979.601019948979, 8021.438499304993, 914.5153068873508, 924.4684306523641, 972.2659392158874, 1037.6886933919793, 1044.9425281609433, 29669.0, 29874.551881721793, 30691.539626905615, 31496.37007259842, 32189.356212875613, 1004.42747633848, 1039.6880935719405, 1072.485207100596, 1092.3500517192258, 1139.4416735799564, 14667.266636668124, 14928.178950157846, 14929.695613965, 14978.17620030887, 15034.774478382833, 301199.0, 304563.0, 304838.0, 305096.0, 305372.0, 56594.717026414604, 57169.14246286309, 57172.0, 57260.0, 57271.0, 1319.089828018664, 1319.0964189530202, 1319.4656164253493, 1347.077252082307, 1348.689801345696, 29075.85462072676, 30165.547516786828, 31025.534616980312, 31765.0, 31998.840005799822, 51591.0, 52159.21761173661, 52324.738376307876, 52613.7369313151, 52688.73655631851, 265158.0, 271668.0, 284837.0, 291264.0, 311648.0, 40065.399019014156, 40453.39319910145, 40640.0, 40660.79669601633, 41346.58653413427, 42898.35652465153, 42935.0, 43137.56862431335, 43208.567914320454, 43332.133357332044, 36654.8167259162, 36778.26443471062, 39948.60051399449, 41536.584634153274, 42011.57988420199, 33442.665573343955, 37806.00220236892, 40052.1989560213, 40968.59031409767, 41553.0, 34892.65107348894, 35360.29279414346, 35507.64492355147, 38402.42396364113, 38467.2306553873, 32917.835410822794, 34227.0, 34316.82841585776, 34855.302893942484, 35077.12307192341, 25812.555709924418, 25937.740622593534, 26218.0, 26265.0, 26653.20040398791], "unit": "score", "name": "ext.html", "value": 18758.793182644178}, {"lowerIsBetter": false, "replicates": [369.4617974515082, 373.2032111442071, 373.36527902565643, 374.6796489001905, 375.69756346141344, 13663.93168034161, 13987.300634968262, 15579.688406231882, 16510.25703843327, 17167.141642917868, 10833.945830270857, 11130.666080017592, 16065.919670401661, 16433.342666293334, 16442.095684737335, 3849.4225866120164, 4815.807367705296, 4946.703197808125, 4955.900881982358, 4957.231629097478, 3937.448757173998, 5317.46825317469, 5468.425815289377, 5491.643043202199, 5519.779208831662, 5457.645253058558, 5489.39616642169, 5684.459976302244, 6054.0, 6058.909116363258, 5772.653640781525, 6020.277566692025, 6026.035834266519, 6044.455998960093, 6071.453569178773, 5372.2210279509645, 5388.622796404254, 5392.676439413648, 5393.2449457076045, 5394.811181608625, 13171.934140329333, 17103.914480427644, 19167.90416047911, 19806.0, 19849.503762406057, 2085.8852763098025, 2088.1751708075376, 2158.3417057797365, 2162.1135334512933, 2182.7708090650412, 9505.952470237673, 9661.372010819274, 9693.321467497279, 10390.99626506565, 13077.149985250928, 1858.962820743591, 1866.6546688862604, 1877.2866310801808, 1884.1992153334777, 1898.6392585408728, 53598.0, 54726.72636636831, 55572.44427555713, 56017.71991140059, 56333.43666563364, 9837.950810245902, 10016.54925528353, 10082.092611664839, 10101.797964040677, 10159.136473399696, 13003.479860805463, 13147.868521314664, 13200.603981880558, 13216.801747973788, 13231.404586793617, 6887.586744795329, 7023.192332881682, 7036.120484939383, 7064.258252883476, 7082.716691332392, 6599.70301336441, 6614.173228346457, 6648.83377915556, 6670.399664030164, 6688.933110668831, 4041.2725709372594, 4226.535081141072, 4234.920095375721, 4395.406620106245, 4535.546445355438, 1734.8438640522413, 1770.2034084661955, 1827.1808007292836, 1843.8709290349816, 1847.0, 884.38093334666, 886.9334799890034, 927.958241879117, 964.7250533597891, 989.351974456732, 15695.921520392554, 16255.593610159603, 16341.26464309109, 16572.58568535796, 16748.24632891523, 871.5467956662627, 876.7676565710092, 915.66120535401, 956.1776871890169, 961.0149596663337, 9073.77315567116, 9506.47714375716, 9512.524373781283, 9588.280878933969, 9697.854532182022, 130193.0, 131343.34328328297, 131790.34104829415, 131913.3404332972, 132191.3390433061, 61629.0, 63044.369556304766, 63875.68062159659, 64911.35088649148, 66288.6685566569, 1106.231169337319, 1113.9443027848574, 1113.9888601113885, 1151.988480115205, 1152.706059954723, 14236.29311248557, 15092.221968395263, 15265.0, 15453.304601292744, 15499.380024798882, 31847.0, 32221.51667724939, 33487.33025339528, 33544.32911341808, 33699.494507582895, 43178.78410608052, 43561.91095222645, 43712.0, 43899.0, 45892.31161532513, 7278.126624805057, 7332.340089391981, 7467.701291948261, 7527.774166775005, 7546.773596792105, 7550.811229719301, 9752.658656947257, 10037.899621003697, 10081.14310283634, 10957.06864916491, 8525.531095789544, 9365.765855853659, 9379.202767764544, 9586.0, 9752.073553012453, 9185.08149185103, 9205.447673139633, 9265.490398028172, 9493.288003399635, 9539.0, 7425.665845037094, 9096.1813436791, 9316.068393160629, 9535.427874327563, 10115.342502737298, 6795.25252222265, 7118.679659415442, 7151.070360853056, 7183.599198156309, 7237.588670209258, 9440.244780417413, 9853.655122070693, 10040.548175331982, 10154.847677284994, 10175.0], "unit": "score", "name": "jquery.html", "value": 7694.066824749653}, {"lowerIsBetter": false, "replicates": [1287.5879718490087, 1448.0370553581865, 1457.6938842843003, 1602.2149146918007, 1769.4249368955093, 6911.343422374879, 7627.771166864996, 7774.572398518087, 7791.571463569501, 7797.142314345431, 7640.083190017192, 7824.687012519493, 7824.921750782491, 7827.7260295889655, 7832.530048197113, 2039.5818857134252, 2082.6251274770534, 2083.656196727538, 2329.8252631052655, 2359.634256690207, 2348.6477028445697, 2385.2844146755992, 2386.4033991502124, 2387.248016874679, 2388.10446082719, 2258.446680563264, 2279.7492275849645, 2305.8270629702756, 2308.515211805523, 2308.9422764430856, 2274.7270327560714, 2276.3284830974903, 2283.4177284792354, 2347.3427440316736, 2348.095983046522, 2331.1258278145697, 2352.6000579901456, 2358.4929240213264, 2358.870262135582, 2366.2782851230368, 7827.921720782833, 7868.6065696715505, 7872.409569282269, 7873.055233371975, 7877.172896845863, 4873.122837889178, 4968.105740966625, 4984.22744474607, 4984.27727979441, 4986.301917731521, 3052.206426329148, 3088.969110308891, 3128.9530657039936, 3199.616046074486, 3297.1921879139522, 999.8900120986685, 1015.4567306490992, 1033.245730616654, 1053.1311667873958, 1056.9260151789379, 10960.342379457257, 11003.119750419946, 11004.0, 11007.284526505831, 11016.614418495314, 4454.821807127743, 4541.159885421208, 4588.059447813191, 4595.793189306489, 4626.467956185014, 9416.717498475056, 9419.764505887271, 9432.669856554987, 9437.339386243035, 9448.102430269113, 5048.217526283359, 5048.949510504848, 5049.368828896388, 5049.747512624354, 5053.267276244924, 4556.430446194226, 4574.268117101248, 4576.473705523841, 4584.0, 4590.196715574761, 3421.3328400961573, 3434.7252219822853, 3623.438367053111, 3659.798711070917, 3708.554973403209, 1121.030308782897, 1123.5955056179769, 1125.1729978465985, 1126.983095253572, 1152.7694461107812, 1038.2732087538752, 1059.1262208677717, 1061.034458642647, 1229.3484453239798, 1365.4060483689627, 7414.0, 7472.813179670552, 7494.887576686354, 7518.774436766906, 7660.923390766021, 1111.155521803419, 1119.2445099557929, 1127.233481232753, 1128.6614015795228, 1142.805857627932, 5861.912071318934, 5953.077273022688, 5953.136795164677, 5953.851153721192, 5957.761689532457, 9004.8649270261, 9170.770730731785, 9173.633054677739, 9197.0, 9314.86027709585, 9256.444613323221, 9269.67556135532, 9319.90680093204, 9343.766405839773, 9351.971283158848, 7115.786526404217, 7179.784606461814, 7384.409247260206, 7386.187519372865, 7446.292602202782, 7242.891356629761, 7327.816804579928, 7343.44924130703, 7348.742794002184, 7580.772576822704, 8472.068072511895, 8485.533295668798, 8671.869921951049, 8770.12298770118, 8805.16350946659, 8675.86986195195, 8817.955910220664, 8818.735437936872, 8945.23965462917, 8965.686200983195, 7425.294597013275, 7527.661255243636, 7528.811779705551, 7533.698652054076, 7546.735864244725, 6690.230623478362, 6855.07456493367, 7299.416046716144, 7530.0, 7533.209013053551, 6945.479089068441, 7001.8949715755325, 7089.929100708927, 7157.713691452492, 7173.964130179525, 6871.4502839773695, 6951.548149370275, 7018.298170182941, 7044.471664625071, 7109.0, 6922.93077069243, 7018.613976231152, 7060.6116663584, 7064.505484616027, 7068.964655176691, 6502.479801615765, 6573.934260657524, 6575.4410875076155, 6575.605463672195, 6583.275839657538, 6562.048502967138, 6615.933840661532, 6622.337766223339, 6713.060171576081, 6714.462842972453], "unit": "score", "name": "mootools.html", "value": 4562.031925773663}, {"lowerIsBetter": false, "replicates": [352.46601398880694, 357.973152013599, 358.69510915721634, 360.62314880949407, 367.2141616939748, 5816.272965879265, 5945.37573554777, 5998.310194327648, 6003.009503431934, 6006.81979540614, 5778.913316300248, 5882.441168089024, 5932.406759324065, 5955.821325360235, 5957.582969192158, 4641.930371044437, 4649.070185962821, 4654.162250794856, 4655.394798676168, 4658.208104622214, 4438.201123797715, 4569.840055598055, 4647.860564183063, 4656.906861862761, 4666.253399456088, 4449.710768800034, 4514.548545145492, 4534.795934182953, 4607.654425918053, 4619.930701039487, 4598.057398233354, 4603.930941035904, 4604.286335617984, 4607.631389488833, 4611.100835337111, 4080.9387859182134, 4091.4476545666253, 4092.1201941582403, 4094.1197642506704, 4097.44684467599, 5493.423190564973, 5631.380548139701, 5634.859128521779, 5640.125780503988, 5658.094704847204, 5377.8117765878005, 5380.892382152374, 5388.326459192601, 5393.2449457076045, 5393.703346315951, 6283.654399008053, 6286.968565157145, 6288.308286088527, 6288.3397243289255, 6289.968550157266, 4545.704529205591, 4548.8862778430475, 4562.1560011398, 4566.70316429431, 4567.703099298535, 6470.57941233823, 6597.670116494156, 6611.140551728293, 6625.304343043959, 6636.469082473391, 4665.810218394356, 4675.929861052087, 4681.648876334289, 4682.157211701859, 4683.180443422388, 4487.080148569601, 4594.448666160082, 4734.668573199911, 4737.147313483606, 4741.691790033637, 5271.235670827785, 5365.919511207335, 5385.3268341457315, 5386.865328366822, 5397.568194544506, 6391.137196478416, 6395.808125756142, 6396.840078998062, 6398.776042838478, 6401.423871851555, 1655.1724137931035, 1656.9502914912573, 1666.6000159961523, 1668.607877148869, 1676.2624445244053, 1124.4995976790249, 1139.8347239650204, 1143.0398465289031, 1151.5048529132387, 1173.20808454293, 6019.849503762441, 6026.126211699279, 6026.969865150646, 6027.397260274025, 6031.517478601701, 6500.674966251669, 6518.120053792677, 6531.804045878631, 6535.934640653532, 6540.70566824494, 5891.882162356729, 6020.307664618625, 6026.638401695912, 6030.276366836008, 6032.788852390233, 3506.3513250048823, 3534.8939531814085, 3538.133157376408, 3538.168530395355, 3539.1152211947015, 6815.0, 6827.897581536281, 6834.2482326944, 6839.076724642109, 6840.931590684029, 6549.312322206195, 6700.0, 6704.497162712719, 6705.631190284581, 6710.899336509956, 6813.2846051163915, 6817.488688348294, 6826.180858297036, 6832.180138383425, 6836.965815170992, 6533.3339998300125, 6540.869182616416, 6553.311902250195, 6558.0, 6563.803085907431, 6327.810165695037, 6452.774152904626, 6460.741570337322, 6473.093766872736, 6478.384553467413, 6820.556663816836, 6822.079019332326, 6829.795106146824, 6840.965795170992, 6849.2808255132495, 4680.672352935262, 4681.133990211822, 4682.765861706833, 4694.812207511798, 4702.670813043054, 6355.586886852339, 6502.739890404331, 6521.315261897622, 6538.901916471352, 6545.967270163809, 6433.903491447539, 6451.935480645134, 6456.0, 6466.288708241996, 6469.159009328757, 6433.774817881352, 6436.549441539048, 6441.0, 6506.0, 6509.023646452881, 6111.449969502766, 6283.3402492737605, 6317.7157027932935, 6318.399752023551, 6353.777617783356, 6493.123428337114, 6506.4469520091325, 6507.609543427409, 6512.0, 6512.804615861532, 6320.462760665211, 6324.209473815773, 6325.240971083499, 6326.272478664829, 6330.746770129327], "unit": "score", "name": "prototype.html", "value": 4843.402972072475}, {"lowerIsBetter": false, "replicates": [761.5126319155742, 804.556182860875, 839.6046695548805, 851.5316575883263, 861.0915484164204, 12915.483380664773, 13006.284654344006, 13058.151220170683, 13061.41223644936, 13072.150310229828, 11995.280283183016, 12044.57843975461, 12060.51757929684, 12064.276143431378, 12066.517339306418, 661.0183876942737, 677.793273051719, 680.5372346804171, 680.5780416141998, 680.8434060166164, 812.10262659761, 817.7056259746487, 822.0833770346051, 824.7608193623872, 825.7151282807422, 853.8676505141713, 868.0408148995364, 868.8870446841902, 869.1656010230155, 869.5391442535466, 689.4794430205188, 700.7337211859511, 837.2339309531772, 854.5855260198798, 856.5331894117721, 631.1447987976318, 631.277187620177, 632.0866348126958, 632.8133200705756, 633.7179954920063, 12203.389830508439, 12249.877501224963, 12270.509179632803, 12292.877071229263, 12305.507779688802, 12007.57973470933, 12257.938710306391, 12518.874811251953, 12744.553940612126, 13019.153755005895, 9967.252456065824, 10030.699079027641, 10187.643432479901, 10253.79492410155, 10496.265261431703, 3448.741344399155, 3455.2571197192474, 3501.457274122515, 3691.9261614767556, 3695.833687484043, 46479.0, 46566.301505477444, 46632.53367466316, 46819.53180468186, 46855.29717054213, 10157.085862272432, 10180.727409073867, 10301.896981030244, 10437.32157409766, 10731.409772462433, 18500.814991850177, 18503.629927401376, 18506.81493185051, 18525.166367513495, 18533.07334633263, 7264.600446975362, 7293.635318234067, 7357.52176108562, 7521.962390188123, 7596.08846938371, 4285.61429471349, 4326.394304797331, 4338.0, 4343.652507799432, 4348.173846969065, 3086.5215891536845, 3131.984340078285, 3136.2159460134967, 3138.9686103139134, 3140.4190224808485, 553.4741995104666, 555.4528789142691, 561.7894032845311, 567.8410045187354, 582.8863371642574, 504.29650637360675, 543.114723001505, 547.6604505206798, 597.7961842163952, 643.8036398898288, 8497.405181637227, 9235.630574777068, 9416.670416535388, 9540.713778586654, 9611.134997850228, 503.8337348675002, 575.8549403472033, 637.5059329019954, 709.8890236779424, 743.7657138001513, 3994.3009973254566, 4026.879193624196, 4054.5742697016976, 4322.459692538433, 4598.402207713043, 55258.0, 56653.716731416076, 57776.42223577711, 57827.71086144543, 58157.0, 50080.749596251786, 50596.49403505918, 50823.49176508262, 50836.74581627068, 51239.975200495785, 46998.0, 47200.29199562009, 47662.76168619135, 47981.0, 48043.03913921772, 9019.729408117766, 9064.592093355946, 9146.451212927246, 9438.716838494856, 9490.620375184915, 35739.28521429609, 36192.27615447624, 36708.632913670524, 36775.26449471049, 36859.44710829286, 42515.149697006505, 42597.5740242606, 46174.769126154155, 46331.0, 46944.53055469538, 11526.94236528812, 11538.88461115378, 11928.522859085539, 11980.101492387932, 12219.69450763738, 12474.313912734524, 12516.436760345989, 12597.685057873627, 12616.936915315364, 13158.671033224246, 11343.829842552203, 11415.885841141482, 11852.34812085309, 12001.339926304137, 12469.688257793265, 11725.589604364148, 12086.214396064228, 12103.0, 12336.0, 12684.492620295085, 7696.384289256958, 10333.0, 11688.064954803425, 11737.941310293394, 12133.150679452707, 9193.310501712265, 9626.133647971716, 9826.16477599412, 10061.89938100639, 10251.538680759235, 8393.83212335762, 9483.193928515877, 9728.75678108053, 9814.263930205121, 10323.174146068146], "unit": "score", "name": "yui.html", "value": 6287.180405671733}], "name": "dromaeo_css", "value": 6844.38442292085}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 109.0, 107.0, 108.0, 111.0, 111.0, 111.0, 110.0, 102.0, 109.0], "unit": "score", "name": "ai-astar", "value": 108.9}, {"lowerIsBetter": true, "replicates": [154.0, 128.0, 153.0, 165.0, 126.0, 162.0, 153.0, 132.0, 165.0, 125.0], "unit": "score", "name": "audio-beat-detection", "value": 146.3}, {"lowerIsBetter": true, "replicates": [162.0, 159.0, 161.0, 160.0, 161.0, 160.0, 160.0, 161.0, 162.0, 161.0], "unit": "score", "name": "audio-dft", "value": 160.7}, {"lowerIsBetter": true, "replicates": [73.0, 72.0, 107.0, 91.0, 75.0, 73.0, 73.0, 113.0, 95.0, 75.0], "unit": "score", "name": "audio-fft", "value": 84.7}, {"lowerIsBetter": true, "replicates": [97.0, 97.0, 140.0, 96.0, 96.0, 98.0, 142.0, 97.0, 98.0, 151.0], "unit": "score", "name": "audio-oscillator", "value": 111.2}, {"lowerIsBetter": true, "replicates": [109.0, 109.0, 109.0, 109.0, 109.0, 109.0, 109.0, 108.0, 110.0, 109.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.0}, {"lowerIsBetter": true, "replicates": [146.0, 145.0, 145.0, 145.0, 146.0, 145.0, 146.0, 145.0, 145.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.3}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 96.0, 96.0, 96.0, 95.0, 96.0, 96.0, 95.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.8}, {"lowerIsBetter": true, "replicates": [55.0, 56.0, 55.0, 55.0, 55.0, 56.0, 56.0, 56.0, 56.0, 53.0], "unit": "score", "name": "json-parse-financial", "value": 55.3}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 68.0, 67.0, 68.0, 68.0, 67.0, 67.0, 67.0, 67.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.3}, {"lowerIsBetter": true, "replicates": [80.0, 81.0, 82.0, 81.0, 85.0, 81.0, 90.0, 82.0, 90.0, 84.0], "unit": "score", "name": "stanford-crypto-aes", "value": 83.6}, {"lowerIsBetter": true, "replicates": [112.0, 115.0, 127.0, 131.0, 125.0, 124.0, 115.0, 114.0, 114.0, 124.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 120.1}, {"lowerIsBetter": true, "replicates": [142.0, 137.0, 141.0, 143.0, 141.0, 129.0, 142.0, 132.0, 132.0, 139.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 137.8}, {"lowerIsBetter": true, "replicates": [67.0, 66.0, 66.0, 65.0, 67.0, 64.0, 65.0, 66.0, 67.0, 65.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 65.8}], "name": "kraken", "value": 1491.7999999999995}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [166.6944490748458], "unit": "score", "name": "Richards", "value": 211.77669800000004}, {"lowerIsBetter": false, "replicates": [193.53590090961873], "unit": "score", "name": "DeltaBlue", "value": 341.6317059999999}, {"lowerIsBetter": false, "replicates": [280.50490883590464], "unit": "score", "name": "Encrypt", "value": 948.9352650000003}, {"lowerIsBetter": false, "replicates": [5256.544502617801], "unit": "score", "name": "Decrypt", "value": 50.6380189243028}, {"lowerIsBetter": false, "replicates": [1114.8272017837235], "unit": "score", "name": "RayTrace", "value": 663.7701329999999}, {"lowerIsBetter": false, "replicates": [771.604938271605], "unit": "score", "name": "Earley", "value": 863.7360479999996}, {"lowerIsBetter": false, "replicates": [12195.121951219513], "unit": "score", "name": "Boyer", "value": 54.64996600000001}, {"lowerIsBetter": false, "replicates": [42604.166666666664], "unit": "score", "name": "RegExp", "value": 21.382533007334946}, {"lowerIsBetter": false, "replicates": [568.5048322910744], "unit": "score", "name": "Splay", "value": 143.34266900000006}, {"lowerIsBetter": false, "replicates": [4817.307692307692], "unit": "score", "name": "NavierStokes", "value": 308.055888223553}], "name": "v8_7", "value": 20119.83535864444}]} 05:58:19 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,1,35]]", "result": "20119.84"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,1,35]]", "result": "1491.80"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,1,35]]", "result": "6844.38"}}} 05:58:19 INFO - Return code: 0 05:58:19 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 05:58:19 INFO - # TBPL SUCCESS # 05:58:19 INFO - Running post-action listener: _resource_record_post_action 05:58:19 INFO - Running post-run listener: _resource_record_post_run 05:58:20 INFO - Total resource usage - Wall time: 1229s; CPU: 13.0%; Read bytes: 0; Write bytes: 544710656; Read time: 0; Write time: 561788 05:58:20 INFO - install - Wall time: 16s; CPU: 15.0%; Read bytes: 0; Write bytes: 246493184; Read time: 0; Write time: 358216 05:58:20 INFO - run-tests - Wall time: 1214s; CPU: 13.0%; Read bytes: 0; Write bytes: 298217472; Read time: 0; Write time: 203572 05:58:20 INFO - Running post-run listener: _upload_blobber_files 05:58:20 INFO - Blob upload gear active. 05:58:20 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 05:58:20 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 05:58:20 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 05:58:20 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Firefox -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 05:58:21 INFO - (blobuploader) - INFO - Open directory for files ... 05:58:21 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 05:58:21 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:58:21 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:58:22 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 05:58:22 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:58:22 INFO - (blobuploader) - INFO - Done attempting. 05:58:22 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 05:58:22 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:58:22 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:58:22 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 05:58:22 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:58:22 INFO - (blobuploader) - INFO - Done attempting. 05:58:22 INFO - (blobuploader) - INFO - Iteration through files over. 05:58:23 INFO - Return code: 0 05:58:23 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 05:58:23 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 05:58:23 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c2f01f7306f10661f1a67e6e856d3919d0ae40436d9154406a4a8f56b26cfafb4a1eab136bc0c7d025da032bb742d8dbf8ab5c81ea2ff90f68f883085e4d47c1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a35f6366482f8b736da4373088bc19c005793e2a67678abaf5c1cbce25d5a754dd91bd733e80c440266c022c268c492b541f037a68baa39acef03ee7314a3b69"} 05:58:23 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 05:58:23 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 05:58:23 INFO - Contents: 05:58:23 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c2f01f7306f10661f1a67e6e856d3919d0ae40436d9154406a4a8f56b26cfafb4a1eab136bc0c7d025da032bb742d8dbf8ab5c81ea2ff90f68f883085e4d47c1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a35f6366482f8b736da4373088bc19c005793e2a67678abaf5c1cbce25d5a754dd91bd733e80c440266c022c268c492b541f037a68baa39acef03ee7314a3b69"} 05:58:23 INFO - Running post-run listener: copy_logs_to_upload_dir 05:58:23 INFO - Copying logs to upload dir... 05:58:23 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 05:58:23 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1268.331838 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2016-01-24 05:58:22.056906) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-24 05:58:22.060823) ========= 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=82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c2f01f7306f10661f1a67e6e856d3919d0ae40436d9154406a4a8f56b26cfafb4a1eab136bc0c7d025da032bb742d8dbf8ab5c81ea2ff90f68f883085e4d47c1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a35f6366482f8b736da4373088bc19c005793e2a67678abaf5c1cbce25d5a754dd91bd733e80c440266c022c268c492b541f037a68baa39acef03ee7314a3b69"} build_url:https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011297 build_url: 'https://queue.taskcluster.net/v1/task/JqfwjRB1TV-UfdqWeHVnFg/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c2f01f7306f10661f1a67e6e856d3919d0ae40436d9154406a4a8f56b26cfafb4a1eab136bc0c7d025da032bb742d8dbf8ab5c81ea2ff90f68f883085e4d47c1", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a35f6366482f8b736da4373088bc19c005793e2a67678abaf5c1cbce25d5a754dd91bd733e80c440266c022c268c492b541f037a68baa39acef03ee7314a3b69"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-24 05:58:22.086508) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 05:58:22.086883) ========= 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=82e07478c745e68b1fe4678a000001bc-1453638391.61562-1789031806 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004502 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-24 05:58:22.170731) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-24 05:58:22.171084) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-24 05:58:22.171456) ========= ========= Total master_lag: 0.34 =========