builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-045 starttime: 1453425218.16 results: success (0) buildid: 20160121143004 builduid: 96202919bf9743aa836b31acd0a1694b revision: ebaf5066ddd3c718cc2bd421f340809e6ab6f260 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.163940) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.164298) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.164573) ========= 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=1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006425 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.189228) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.189528) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.204616) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.204879) ========= 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=1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004560 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.253052) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.253329) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.253653) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.253933) ========= 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=1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-21 17:13:38-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 22.1M=0.001s 2016-01-21 17:13:38 (22.1 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.158878 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.424553) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.424837) ========= 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=1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018092 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.474222) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:38.474535) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev ebaf5066ddd3c718cc2bd421f340809e6ab6f260 --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev ebaf5066ddd3c718cc2bd421f340809e6ab6f260 --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=1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-21 17:13:38,788 truncating revision to first 12 chars 2016-01-21 17:13:38,788 Setting DEBUG logging. 2016-01-21 17:13:38,788 attempt 1/10 2016-01-21 17:13:38,788 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/ebaf5066ddd3?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-21 17:13:39,035 unpacking tar archive at: fx-team-ebaf5066ddd3/testing/mozharness/ program finished with exit code 0 elapsedTime=0.533662 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:39.020346) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:39.020640) ========= echo ebaf5066ddd3c718cc2bd421f340809e6ab6f260 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'ebaf5066ddd3c718cc2bd421f340809e6ab6f260'] 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=1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False ebaf5066ddd3c718cc2bd421f340809e6ab6f260 program finished with exit code 0 elapsedTime=0.004642 script_repo_revision: 'ebaf5066ddd3c718cc2bd421f340809e6ab6f260' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:39.072576) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:39.072861) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-21 17:13:39.083093) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 5 secs) (at 2016-01-21 17:13:39.083395) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 17:13:39 INFO - MultiFileLogger online at 20160121 17:13:39 in /builds/slave/test-pgo 17:13:39 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 17:13:39 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 17:13:39 INFO - {'append_to_log': False, 17:13:39 INFO - 'base_work_dir': '/builds/slave/test-pgo', 17:13:39 INFO - 'blob_upload_branch': 'Fx-Team', 17:13:39 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 17:13:39 INFO - 'branch': 'Fx-Team', 17:13:39 INFO - 'buildbot_json_path': 'buildprops.json', 17:13:39 INFO - 'config_files': ('talos/linux_config.py',), 17:13:39 INFO - 'default_actions': ('clobber', 17:13:39 INFO - 'read-buildbot-config', 17:13:39 INFO - 'download-and-extract', 17:13:39 INFO - 'populate-webroot', 17:13:39 INFO - 'create-virtualenv', 17:13:39 INFO - 'install', 17:13:39 INFO - 'run-tests'), 17:13:39 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:13:39 INFO - 'download_minidump_stackwalk': True, 17:13:39 INFO - 'download_symbols': 'ondemand', 17:13:39 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:13:39 INFO - 'tooltool.py': '/tools/tooltool.py', 17:13:39 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:13:39 INFO - '/tools/misc-python/virtualenv.py')}, 17:13:39 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:13:39 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:13:39 INFO - 'installer_path': 'installer.exe', 17:13:39 INFO - 'log_level': 'info', 17:13:39 INFO - 'log_name': 'talos', 17:13:39 INFO - 'log_to_console': True, 17:13:39 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 17:13:39 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 17:13:39 INFO - 'opt_config_files': (), 17:13:39 INFO - 'pip_index': False, 17:13:39 INFO - 'sps_profile': False, 17:13:39 INFO - 'sps_profile_interval': 0, 17:13:39 INFO - 'suite': 'dromaeojs-e10s', 17:13:39 INFO - 'system_bits': '32', 17:13:39 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:13:39 INFO - 'title': 'talos-linux64-ix-045', 17:13:39 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:13:39 INFO - 'use_talos_json': True, 17:13:39 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 17:13:39 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:13:39 INFO - 'work_dir': 'build'} 17:13:39 INFO - ##### 17:13:39 INFO - ##### Running clobber step. 17:13:39 INFO - ##### 17:13:39 INFO - Running pre-action listener: _resource_record_pre_action 17:13:39 INFO - Running main action method: clobber 17:13:39 INFO - rmtree: /builds/slave/test-pgo/build 17:13:39 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 17:13:40 INFO - Running post-action listener: _resource_record_post_action 17:13:40 INFO - ##### 17:13:40 INFO - ##### Running read-buildbot-config step. 17:13:40 INFO - ##### 17:13:40 INFO - Running pre-action listener: _resource_record_pre_action 17:13:40 INFO - Running main action method: read_buildbot_config 17:13:40 INFO - Using buildbot properties: 17:13:40 INFO - { 17:13:40 INFO - "project": "", 17:13:40 INFO - "product": "firefox", 17:13:40 INFO - "script_repo_revision": "production", 17:13:40 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 17:13:40 INFO - "repository": "", 17:13:40 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 17:13:40 INFO - "buildid": "20160121143004", 17:13:40 INFO - "pgo_build": "True", 17:13:40 INFO - "basedir": "/builds/slave/test-pgo", 17:13:40 INFO - "buildnumber": 458, 17:13:40 INFO - "slavename": "talos-linux64-ix-045", 17:13:40 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 17:13:40 INFO - "platform": "ubuntu64_hw", 17:13:40 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 17:13:40 INFO - "branch": "fx-team", 17:13:40 INFO - "repo_path": "integration/fx-team", 17:13:40 INFO - "revision": "ebaf5066ddd3c718cc2bd421f340809e6ab6f260", 17:13:40 INFO - "stage_platform": "linux64-pgo", 17:13:40 INFO - "builduid": "96202919bf9743aa836b31acd0a1694b", 17:13:40 INFO - "slavebuilddir": "test" 17:13:40 INFO - } 17:13:40 INFO - Found installer url https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 17:13:40 INFO - Running post-action listener: _resource_record_post_action 17:13:40 INFO - ##### 17:13:40 INFO - ##### Running download-and-extract step. 17:13:40 INFO - ##### 17:13:40 INFO - Running pre-action listener: _resource_record_pre_action 17:13:40 INFO - Running main action method: download_and_extract 17:13:40 INFO - mkdir: /builds/slave/test-pgo/build/tests 17:13: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')]} 17:13:40 INFO - https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 17:13:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/test_packages.json 17:13:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/test_packages.json 17:13:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 17:13:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 17:13:41 INFO - Downloaded 1448 bytes. 17:13:41 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 17:13:41 INFO - Using the following test package requirements: 17:13:41 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 17:13:41 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 17:13:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 17:13:41 INFO - u'gtest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 17:13:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.gtest.tests.zip'], 17:13:41 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 17:13:41 INFO - u'jsshell-linux-x86_64.zip'], 17:13:41 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 17:13:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 17:13:41 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 17:13:41 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 17:13:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 17:13:41 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 17:13:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 17:13:41 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 17:13:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 17:13:41 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 17:13:41 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 17:13:41 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 17:13:41 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 17:13:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:13:41 INFO - https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 17:13:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 17:13:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 17:13:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/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 17:13:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/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 17:13:42 INFO - Downloaded 22486623 bytes. 17:13:42 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'] 17:13:42 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 17:13:44 INFO - Return code: 0 17:13:44 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 17:13: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')]} 17:13:44 INFO - https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 17:13:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 17:13:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 17:13:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/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 17:13:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/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 17:13:45 INFO - Downloaded 22486623 bytes. 17:13:45 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'] 17:13:45 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 17:13:46 INFO - Return code: 0 17:13: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')]} 17:13:46 INFO - https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 17:13:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 17:13:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 17:13:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/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 17:13:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/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 17:13:47 INFO - Downloaded 10706572 bytes. 17:13:47 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'] 17:13:47 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 17:13:47 INFO - Return code: 0 17:13:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:13:47 INFO - https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 17:13:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 17:13:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 17:13:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/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 17:13:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/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 17:13:50 INFO - Downloaded 55896471 bytes. 17:13:50 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 17:13:50 INFO - mkdir: /builds/slave/test-pgo/properties 17:13:50 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 17:13:50 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 17:13:50 INFO - Contents: 17:13:50 INFO - build_url:https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 17:13:50 INFO - Running post-action listener: _resource_record_post_action 17:13:50 INFO - Running post-action listener: set_extra_try_arguments 17:13:50 INFO - ##### 17:13:50 INFO - ##### Running populate-webroot step. 17:13:50 INFO - ##### 17:13:50 INFO - Running pre-action listener: _resource_record_pre_action 17:13:50 INFO - Running main action method: populate_webroot 17:13:50 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 17:13:50 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 17:13:50 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 17:13:50 INFO - '--tppagecycles', 17:13:50 INFO - '7'], 17:13:50 INFO - 'tests': ['tsvgm']}}, 17:13:50 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 17:13:50 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 17:13:50 INFO - 'tests': ['tresize', 'tcanvasmark']}, 17:13:50 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 17:13:50 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 17:13:50 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 17:13:50 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:13:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:13:50 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:13:50 INFO - 'talos_options': ['--e10s'], 17:13:50 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:13:50 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:13:50 INFO - 'tests': ['damp', 'tps']}, 17:13:50 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:13:50 INFO - 'talos_options': ['--e10s'], 17:13:50 INFO - 'tests': ['damp', 'tps']}, 17:13:50 INFO - 'g3': {'tests': ['dromaeo_dom']}, 17:13:50 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:13:50 INFO - 'other': {'tests': ['a11yr', 17:13:50 INFO - 'ts_paint', 17:13:50 INFO - 'tpaint', 17:13:50 INFO - 'sessionrestore', 17:13:50 INFO - 'sessionrestore_no_auto_restore']}, 17:13:50 INFO - 'other-e10s': {'talos_options': ['--e10s'], 17:13:50 INFO - 'tests': ['a11yr', 17:13:50 INFO - 'ts_paint', 17:13:50 INFO - 'tpaint', 17:13:50 INFO - 'sessionrestore', 17:13:50 INFO - 'sessionrestore_no_auto_restore']}, 17:13:50 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 17:13:50 INFO - 'tests': ['a11yr', 17:13:50 INFO - 'ts_paint', 17:13:50 INFO - 'tpaint', 17:13:50 INFO - 'sessionrestore', 17:13:50 INFO - 'sessionrestore_no_auto_restore']}, 17:13:50 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 17:13:50 INFO - 'tests': ['a11yr', 17:13:50 INFO - 'ts_paint', 17:13:50 INFO - 'tpaint', 17:13:50 INFO - 'sessionrestore', 17:13:50 INFO - 'sessionrestore_no_auto_restore']}, 17:13:50 INFO - 'other_l64': {'tests': ['a11yr', 17:13:50 INFO - 'ts_paint', 17:13:50 INFO - 'tpaint', 17:13:50 INFO - 'sessionrestore', 17:13:50 INFO - 'sessionrestore_no_auto_restore']}, 17:13:50 INFO - 'other_nol64': {'tests': ['a11yr', 17:13:50 INFO - 'ts_paint', 17:13:50 INFO - 'tpaint', 17:13:50 INFO - 'sessionrestore', 17:13:50 INFO - 'sessionrestore_no_auto_restore']}, 17:13:50 INFO - 'svgr': {'tests': ['tsvgx', 17:13:50 INFO - 'tsvgr_opacity', 17:13:50 INFO - 'tart', 17:13:50 INFO - 'tscrollx', 17:13:50 INFO - 'cart']}, 17:13:50 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 17:13:50 INFO - 'tests': ['tsvgx', 17:13:50 INFO - 'tsvgr_opacity', 17:13:50 INFO - 'tart', 17:13:50 INFO - 'tscrollx', 17:13:50 INFO - 'cart']}, 17:13:50 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:13:50 INFO - 'tests': ['tp5o']}, 17:13:50 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:13:50 INFO - 'talos_options': ['--e10s'], 17:13:50 INFO - 'tests': ['tp5o']}, 17:13:50 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:13:50 INFO - 'talos_options': ['--xperf_path', 17:13:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:13:50 INFO - 'tests': ['tp5n']}, 17:13:50 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:13:50 INFO - 'talos_options': ['--e10s', 17:13:50 INFO - '--xperf_path', 17:13:50 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:13:50 INFO - 'tests': ['tp5n']}}, 17:13:50 INFO - 'talos.zip': {'path': '', 17:13:50 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 17:13:50 INFO - Running post-action listener: _resource_record_post_action 17:13:50 INFO - ##### 17:13:50 INFO - ##### Running create-virtualenv step. 17:13:50 INFO - ##### 17:13:50 INFO - Running pre-action listener: _resource_record_pre_action 17:13:50 INFO - Running main action method: create_virtualenv 17:13:50 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 17:13:50 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 17:13:50 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 17:13:50 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:13:50 INFO - Using real prefix '/usr' 17:13:50 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 17:13:51 INFO - Installing distribute.............................................................................................................................................................................................done. 17:13:53 INFO - Installing pip.................done. 17:13:53 INFO - Return code: 0 17:13:53 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 17:13:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:13:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:13:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:13:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:13:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:13:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:13:53 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa92d6d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e99480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f28660>, '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 0x1f29560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f29a10>, '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': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', '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 17:13:53 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 17:13:53 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 17:13:53 INFO - Using env: {'DISPLAY': ':0', 17:13:53 INFO - 'HOME': '/home/cltbld', 17:13:53 INFO - 'LANG': 'en_US.UTF-8', 17:13:53 INFO - 'LANGUAGE': 'en_US:en', 17:13:53 INFO - 'LOGNAME': 'cltbld', 17:13:53 INFO - 'MAIL': '/var/mail/cltbld', 17:13:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:13:53 INFO - 'MOZ_NO_REMOTE': '1', 17:13:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:13:53 INFO - 'NO_EM_RESTART': '1', 17:13:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:13:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:13:53 INFO - 'PWD': '/builds/slave/test-pgo', 17:13:53 INFO - 'SHELL': '/bin/bash', 17:13:53 INFO - 'SHLVL': '1', 17:13:53 INFO - 'TERM': 'linux', 17:13:53 INFO - 'TMOUT': '86400', 17:13:53 INFO - 'USER': 'cltbld', 17:13:53 INFO - 'XDG_SESSION_COOKIE': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', 17:13:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:13:53 INFO - '_': '/tools/buildbot/bin/python'} 17:13:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:13:53 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 17:13:53 INFO - Cleaning up... 17:13:53 INFO - Return code: 0 17:13:53 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 17:13:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:13:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:13:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:13:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:13:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:13:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:13:53 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa92d6d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e99480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f28660>, '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 0x1f29560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f29a10>, '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': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', '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 17:13:53 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 17:13:53 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 17:13:53 INFO - Using env: {'DISPLAY': ':0', 17:13:53 INFO - 'HOME': '/home/cltbld', 17:13:53 INFO - 'LANG': 'en_US.UTF-8', 17:13:53 INFO - 'LANGUAGE': 'en_US:en', 17:13:53 INFO - 'LOGNAME': 'cltbld', 17:13:53 INFO - 'MAIL': '/var/mail/cltbld', 17:13:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:13:53 INFO - 'MOZ_NO_REMOTE': '1', 17:13:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:13:53 INFO - 'NO_EM_RESTART': '1', 17:13:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:13:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:13:53 INFO - 'PWD': '/builds/slave/test-pgo', 17:13:53 INFO - 'SHELL': '/bin/bash', 17:13:53 INFO - 'SHLVL': '1', 17:13:53 INFO - 'TERM': 'linux', 17:13:53 INFO - 'TMOUT': '86400', 17:13:53 INFO - 'USER': 'cltbld', 17:13:53 INFO - 'XDG_SESSION_COOKIE': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', 17:13:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:13:53 INFO - '_': '/tools/buildbot/bin/python'} 17:13:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:13:53 INFO - Downloading/unpacking psutil>=0.7.1 17:13:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:13:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:13:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:13:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:13:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:13:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:13:55 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 17:13:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:13:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:13:55 INFO - Installing collected packages: psutil 17:13:55 INFO - Running setup.py install for psutil 17:13:55 INFO - building 'psutil._psutil_linux' extension 17:13:55 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 17:13:55 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 17:13:55 INFO - building 'psutil._psutil_posix' extension 17:13:55 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 17:13:55 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 17:13:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:13:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:13:55 INFO - Successfully installed psutil 17:13:55 INFO - Cleaning up... 17:13:55 INFO - Return code: 0 17:13:55 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 17:13:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:13:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:13:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:13:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:13:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:13:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:13:55 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa92d6d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e99480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f28660>, '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 0x1f29560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f29a10>, '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': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', '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 17:13:55 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 17:13:55 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 17:13:55 INFO - Using env: {'DISPLAY': ':0', 17:13:55 INFO - 'HOME': '/home/cltbld', 17:13:55 INFO - 'LANG': 'en_US.UTF-8', 17:13:55 INFO - 'LANGUAGE': 'en_US:en', 17:13:55 INFO - 'LOGNAME': 'cltbld', 17:13:55 INFO - 'MAIL': '/var/mail/cltbld', 17:13:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:13:55 INFO - 'MOZ_NO_REMOTE': '1', 17:13:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:13:55 INFO - 'NO_EM_RESTART': '1', 17:13:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:13:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:13:55 INFO - 'PWD': '/builds/slave/test-pgo', 17:13:55 INFO - 'SHELL': '/bin/bash', 17:13:55 INFO - 'SHLVL': '1', 17:13:56 INFO - 'TERM': 'linux', 17:13:56 INFO - 'TMOUT': '86400', 17:13:56 INFO - 'USER': 'cltbld', 17:13:56 INFO - 'XDG_SESSION_COOKIE': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', 17:13:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:13:56 INFO - '_': '/tools/buildbot/bin/python'} 17:13:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:13:56 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 17:13:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:13:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:13:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:13:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:13:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:13:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:13:57 INFO - Downloading mozsystemmonitor-0.0.tar.gz 17:13:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:13:58 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 17:13:58 INFO - Installing collected packages: mozsystemmonitor 17:13:58 INFO - Running setup.py install for mozsystemmonitor 17:13:58 INFO - Successfully installed mozsystemmonitor 17:13:58 INFO - Cleaning up... 17:13:58 INFO - Return code: 0 17:13:58 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 17:13:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:13:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:13:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:13:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:13:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:13:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:13:58 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa92d6d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e99480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f28660>, '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 0x1f29560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f29a10>, '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': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', '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 17:13:58 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 17:13:58 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 17:13:58 INFO - Using env: {'DISPLAY': ':0', 17:13:58 INFO - 'HOME': '/home/cltbld', 17:13:58 INFO - 'LANG': 'en_US.UTF-8', 17:13:58 INFO - 'LANGUAGE': 'en_US:en', 17:13:58 INFO - 'LOGNAME': 'cltbld', 17:13:58 INFO - 'MAIL': '/var/mail/cltbld', 17:13:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:13:58 INFO - 'MOZ_NO_REMOTE': '1', 17:13:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:13:58 INFO - 'NO_EM_RESTART': '1', 17:13:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:13:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:13:58 INFO - 'PWD': '/builds/slave/test-pgo', 17:13:58 INFO - 'SHELL': '/bin/bash', 17:13:58 INFO - 'SHLVL': '1', 17:13:58 INFO - 'TERM': 'linux', 17:13:58 INFO - 'TMOUT': '86400', 17:13:58 INFO - 'USER': 'cltbld', 17:13:58 INFO - 'XDG_SESSION_COOKIE': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', 17:13:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:13:58 INFO - '_': '/tools/buildbot/bin/python'} 17:13:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:13:58 INFO - Downloading/unpacking blobuploader==1.2.4 17:13:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:13:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:13:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:13:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:13:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:13:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:00 INFO - Downloading blobuploader-1.2.4.tar.gz 17:14:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:14:00 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:14:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 17:14:00 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:14:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:00 INFO - Downloading docopt-0.6.1.tar.gz 17:14:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 17:14:00 INFO - Installing collected packages: blobuploader, requests, docopt 17:14:00 INFO - Running setup.py install for blobuploader 17:14:00 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:14:00 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 17:14:00 INFO - Running setup.py install for requests 17:14:01 INFO - Running setup.py install for docopt 17:14:01 INFO - Successfully installed blobuploader requests docopt 17:14:01 INFO - Cleaning up... 17:14:01 INFO - Return code: 0 17:14:01 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 17:14:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:14:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:14:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:14:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:14:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:14:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:14:01 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa92d6d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e99480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f28660>, '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 0x1f29560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f29a10>, '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': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', '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 17:14:01 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 17:14:01 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:14:01 INFO - Using env: {'DISPLAY': ':0', 17:14:01 INFO - 'HOME': '/home/cltbld', 17:14:01 INFO - 'LANG': 'en_US.UTF-8', 17:14:01 INFO - 'LANGUAGE': 'en_US:en', 17:14:01 INFO - 'LOGNAME': 'cltbld', 17:14:01 INFO - 'MAIL': '/var/mail/cltbld', 17:14:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:14:01 INFO - 'MOZ_NO_REMOTE': '1', 17:14:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:14:01 INFO - 'NO_EM_RESTART': '1', 17:14:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:14:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:14:01 INFO - 'PWD': '/builds/slave/test-pgo', 17:14:01 INFO - 'SHELL': '/bin/bash', 17:14:01 INFO - 'SHLVL': '1', 17:14:01 INFO - 'TERM': 'linux', 17:14:01 INFO - 'TMOUT': '86400', 17:14:01 INFO - 'USER': 'cltbld', 17:14:01 INFO - 'XDG_SESSION_COOKIE': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', 17:14:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:14:01 INFO - '_': '/tools/buildbot/bin/python'} 17:14:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:14:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 17:14:01 INFO - Running setup.py (path:/tmp/pip-OqF3Jf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 17:14:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 17:14:01 INFO - Running setup.py (path:/tmp/pip-Df8lma-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 17:14:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 17:14:01 INFO - Running setup.py (path:/tmp/pip-s52TDP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 17:14:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 17:14:01 INFO - Running setup.py (path:/tmp/pip-Y3SpjB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 17:14:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 17:14:01 INFO - Running setup.py (path:/tmp/pip-gE1v5C-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 17:14:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 17:14:02 INFO - Running setup.py (path:/tmp/pip-zOIlxT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 17:14:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 17:14:02 INFO - Running setup.py (path:/tmp/pip-TKoD_k-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 17:14:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 17:14:02 INFO - Running setup.py (path:/tmp/pip-P0qIea-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 17:14:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 17:14:02 INFO - Running setup.py (path:/tmp/pip-nLzAy8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 17:14:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 17:14:02 INFO - Running setup.py (path:/tmp/pip-eaV4a3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 17:14:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 17:14:02 INFO - Running setup.py (path:/tmp/pip-wm11p6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 17:14:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 17:14:02 INFO - Running setup.py (path:/tmp/pip-WqIpZt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 17:14:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 17:14:02 INFO - Running setup.py (path:/tmp/pip-hDccJ_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 17:14:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 17:14:02 INFO - Running setup.py (path:/tmp/pip-xlNjRm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 17:14:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 17:14:02 INFO - Running setup.py (path:/tmp/pip-N8GU7m-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 17:14:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 17:14:02 INFO - Running setup.py (path:/tmp/pip-vV3emu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 17:14:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 17:14:02 INFO - Running setup.py (path:/tmp/pip-A9HbdR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 17:14:02 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:14:02 INFO - Running setup.py install for manifestparser 17:14:02 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 17:14:02 INFO - Running setup.py install for mozcrash 17:14:03 INFO - Running setup.py install for mozdebug 17:14:03 INFO - Running setup.py install for mozdevice 17:14:03 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 17:14:03 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 17:14:03 INFO - Running setup.py install for mozfile 17:14:03 INFO - Running setup.py install for mozhttpd 17:14:03 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 17:14:03 INFO - Running setup.py install for mozinfo 17:14:03 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 17:14:03 INFO - Running setup.py install for mozInstall 17:14:03 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 17:14:03 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 17:14:03 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 17:14:03 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 17:14:03 INFO - Running setup.py install for mozleak 17:14:03 INFO - Running setup.py install for mozlog 17:14:03 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 17:14:03 INFO - Running setup.py install for moznetwork 17:14:03 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 17:14:04 INFO - Running setup.py install for mozprocess 17:14:04 INFO - Running setup.py install for mozprofile 17:14:04 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 17:14:04 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 17:14:04 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 17:14:04 INFO - Running setup.py install for mozrunner 17:14:04 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 17:14:04 INFO - Running setup.py install for mozscreenshot 17:14:04 INFO - Running setup.py install for moztest 17:14:04 INFO - Running setup.py install for mozversion 17:14:04 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 17:14:04 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:14:04 INFO - Cleaning up... 17:14:04 INFO - Return code: 0 17:14:04 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 17:14:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:14:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:14:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:14:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:14:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:14:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:14:04 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa92d6d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e99480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f28660>, '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 0x1f29560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f29a10>, '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': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', '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 17:14:04 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 17:14:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:14:04 INFO - Using env: {'DISPLAY': ':0', 17:14:04 INFO - 'HOME': '/home/cltbld', 17:14:04 INFO - 'LANG': 'en_US.UTF-8', 17:14:04 INFO - 'LANGUAGE': 'en_US:en', 17:14:04 INFO - 'LOGNAME': 'cltbld', 17:14:04 INFO - 'MAIL': '/var/mail/cltbld', 17:14:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:14:04 INFO - 'MOZ_NO_REMOTE': '1', 17:14:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:14:04 INFO - 'NO_EM_RESTART': '1', 17:14:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:14:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:14:04 INFO - 'PWD': '/builds/slave/test-pgo', 17:14:04 INFO - 'SHELL': '/bin/bash', 17:14:04 INFO - 'SHLVL': '1', 17:14:04 INFO - 'TERM': 'linux', 17:14:04 INFO - 'TMOUT': '86400', 17:14:04 INFO - 'USER': 'cltbld', 17:14:04 INFO - 'XDG_SESSION_COOKIE': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', 17:14:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:14:04 INFO - '_': '/tools/buildbot/bin/python'} 17:14:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:14:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 17:14:04 INFO - Running setup.py (path:/tmp/pip-fzZACu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 17:14:04 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 17:14:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 17:14:04 INFO - Running setup.py (path:/tmp/pip-auidsV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 17:14:05 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)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 17:14:05 INFO - Running setup.py (path:/tmp/pip-txQT98-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 17:14:05 INFO - Running setup.py (path:/tmp/pip-4wTHNQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 17:14:05 INFO - Running setup.py (path:/tmp/pip-4SfLkF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 17:14:05 INFO - Running setup.py (path:/tmp/pip-jXAxYU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 17:14:05 INFO - Running setup.py (path:/tmp/pip-EBHdMW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 17:14:05 INFO - Running setup.py (path:/tmp/pip-DB3ivD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 17:14:05 INFO - Running setup.py (path:/tmp/pip-Jxc5uE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 17:14:05 INFO - Running setup.py (path:/tmp/pip-pTamjr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 17:14:05 INFO - Running setup.py (path:/tmp/pip-8oBcuP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 17:14:05 INFO - Running setup.py (path:/tmp/pip-NAaSvy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 17:14:05 INFO - Running setup.py (path:/tmp/pip-8UAPfV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 17:14:05 INFO - Running setup.py (path:/tmp/pip-93huYt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 17:14:05 INFO - Running setup.py (path:/tmp/pip-pjL7nZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 17:14:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 17:14:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 17:14:05 INFO - Running setup.py (path:/tmp/pip-uTiqNY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 17:14:06 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)) 17:14:06 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 17:14:06 INFO - Running setup.py (path:/tmp/pip-OMuTQB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 17:14:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 17:14:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 17:14:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 17:14:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 17:14:06 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 17:14:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 17:14:06 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 17:14:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:07 INFO - Downloading blessings-1.6.tar.gz 17:14:07 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 17:14:07 INFO - Installing collected packages: blessings 17:14:07 INFO - Running setup.py install for blessings 17:14:08 INFO - Successfully installed blessings 17:14:08 INFO - Cleaning up... 17:14:08 INFO - Return code: 0 17:14:08 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 17:14:08 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 17:14:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 17:14:08 INFO - Reading from file tmpfile_stdout 17:14:08 INFO - Current package versions: 17:14:08 INFO - argparse == 1.2.1 17:14:08 INFO - blessings == 1.6 17:14:08 INFO - blobuploader == 1.2.4 17:14:08 INFO - docopt == 0.6.1 17:14:08 INFO - manifestparser == 1.1 17:14:08 INFO - mozInstall == 1.12 17:14:08 INFO - mozcrash == 0.16 17:14:08 INFO - mozdebug == 0.1 17:14:08 INFO - mozdevice == 0.48 17:14:08 INFO - mozfile == 1.2 17:14:08 INFO - mozhttpd == 0.7 17:14:08 INFO - mozinfo == 0.9 17:14:08 INFO - mozleak == 0.1 17:14:08 INFO - mozlog == 3.1 17:14:08 INFO - moznetwork == 0.27 17:14:08 INFO - mozprocess == 0.22 17:14:08 INFO - mozprofile == 0.28 17:14:08 INFO - mozrunner == 6.11 17:14:08 INFO - mozscreenshot == 0.1 17:14:08 INFO - mozsystemmonitor == 0.0 17:14:08 INFO - moztest == 0.7 17:14:08 INFO - mozversion == 1.4 17:14:08 INFO - psutil == 3.1.1 17:14:08 INFO - requests == 1.2.3 17:14:08 INFO - wsgiref == 0.1.2 17:14:08 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 17:14:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:14:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:14:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:14:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:14:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:14:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:14:08 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa92d6d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e99480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f28660>, '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 0x1f29560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f29a10>, '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': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', '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 17:14:08 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/talos 17:14:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:14:08 INFO - Using env: {'DISPLAY': ':0', 17:14:08 INFO - 'HOME': '/home/cltbld', 17:14:08 INFO - 'LANG': 'en_US.UTF-8', 17:14:08 INFO - 'LANGUAGE': 'en_US:en', 17:14:08 INFO - 'LOGNAME': 'cltbld', 17:14:08 INFO - 'MAIL': '/var/mail/cltbld', 17:14:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:14:08 INFO - 'MOZ_NO_REMOTE': '1', 17:14:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:14:08 INFO - 'NO_EM_RESTART': '1', 17:14:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:14:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:14:08 INFO - 'PWD': '/builds/slave/test-pgo', 17:14:08 INFO - 'SHELL': '/bin/bash', 17:14:08 INFO - 'SHLVL': '1', 17:14:08 INFO - 'TERM': 'linux', 17:14:08 INFO - 'TMOUT': '86400', 17:14:08 INFO - 'USER': 'cltbld', 17:14:08 INFO - 'XDG_SESSION_COOKIE': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', 17:14:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:14:08 INFO - '_': '/tools/buildbot/bin/python'} 17:14:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:14:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 17:14:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2)) 17:14:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 17:14:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 17:14:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5)) 17:14:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6)) 17:14:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7)) 17:14:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8)) 17:14:08 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 9)) 17:14:08 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 17:14:08 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 17:14:08 INFO - Cleaning up... 17:14:08 INFO - Return code: 0 17:14:08 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 17:14:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:14:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:14:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:14:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:14:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:14:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:14:08 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa92d6d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e99480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f28660>, '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 0x1f29560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f29a10>, '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': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', '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 17:14:08 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test-pgo/build 17:14:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 17:14:08 INFO - Using env: {'DISPLAY': ':0', 17:14:08 INFO - 'HOME': '/home/cltbld', 17:14:08 INFO - 'LANG': 'en_US.UTF-8', 17:14:08 INFO - 'LANGUAGE': 'en_US:en', 17:14:08 INFO - 'LOGNAME': 'cltbld', 17:14:08 INFO - 'MAIL': '/var/mail/cltbld', 17:14:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:14:08 INFO - 'MOZ_NO_REMOTE': '1', 17:14:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:14:08 INFO - 'NO_EM_RESTART': '1', 17:14:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:14:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:14:08 INFO - 'PWD': '/builds/slave/test-pgo', 17:14:08 INFO - 'SHELL': '/bin/bash', 17:14:08 INFO - 'SHLVL': '1', 17:14:08 INFO - 'TERM': 'linux', 17:14:08 INFO - 'TMOUT': '86400', 17:14:08 INFO - 'USER': 'cltbld', 17:14:08 INFO - 'XDG_SESSION_COOKIE': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', 17:14:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:14:08 INFO - '_': '/tools/buildbot/bin/python'} 17:14:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:14:08 INFO - Downloading/unpacking jsonschema 17:14:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:10 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 17:14:10 INFO - Downloading/unpacking functools32 (from jsonschema) 17:14:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:10 INFO - Downloading functools32-3.2.3-2.tar.gz 17:14:10 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 17:14:10 INFO - warning: no files found matching '*.txt' 17:14:10 INFO - no previously-included directories found matching 'build' 17:14:10 INFO - no previously-included directories found matching 'dist' 17:14:10 INFO - no previously-included directories found matching '.git*' 17:14:10 INFO - Installing collected packages: jsonschema, functools32 17:14:10 INFO - Running setup.py install for functools32 17:14:10 INFO - warning: no files found matching '*.txt' 17:14:10 INFO - no previously-included directories found matching 'build' 17:14:10 INFO - no previously-included directories found matching 'dist' 17:14:10 INFO - no previously-included directories found matching '.git*' 17:14:10 INFO - Successfully installed jsonschema functools32 17:14:10 INFO - Cleaning up... 17:14:10 INFO - Return code: 0 17:14:10 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 17:14:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:14:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:14:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:14:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:14:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:14:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:14:10 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa92d6d0f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dcc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e99480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f28660>, '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 0x1f29560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f29a10>, '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': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', '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 17:14:10 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test-pgo/build 17:14:10 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 17:14:10 INFO - Using env: {'DISPLAY': ':0', 17:14:10 INFO - 'HOME': '/home/cltbld', 17:14:10 INFO - 'LANG': 'en_US.UTF-8', 17:14:10 INFO - 'LANGUAGE': 'en_US:en', 17:14:10 INFO - 'LOGNAME': 'cltbld', 17:14:10 INFO - 'MAIL': '/var/mail/cltbld', 17:14:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:14:10 INFO - 'MOZ_NO_REMOTE': '1', 17:14:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:14:10 INFO - 'NO_EM_RESTART': '1', 17:14:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:14:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:14:10 INFO - 'PWD': '/builds/slave/test-pgo', 17:14:10 INFO - 'SHELL': '/bin/bash', 17:14:10 INFO - 'SHLVL': '1', 17:14:10 INFO - 'TERM': 'linux', 17:14:10 INFO - 'TMOUT': '86400', 17:14:10 INFO - 'USER': 'cltbld', 17:14:10 INFO - 'XDG_SESSION_COOKIE': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', 17:14:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:14:10 INFO - '_': '/tools/buildbot/bin/python'} 17:14:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:14:11 INFO - Downloading/unpacking flake8 17:14:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:12 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 17:14:12 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 17:14:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:13 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 17:14:13 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 17:14:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:13 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 17:14:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:14:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:14:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:14:13 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 17:14:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:14:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:14:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:14:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:14:13 INFO - no previously-included directories found matching 'docs/_build' 17:14:13 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 17:14:13 INFO - Running setup.py install for pep8 17:14:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:14:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:14:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:14:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:14:13 INFO - no previously-included directories found matching 'docs/_build' 17:14:13 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 17:14:13 INFO - Successfully installed flake8 mccabe pyflakes pep8 17:14:13 INFO - Cleaning up... 17:14:13 INFO - Return code: 0 17:14:13 INFO - Running post-action listener: _resource_record_post_action 17:14:13 INFO - Running post-action listener: _start_resource_monitoring 17:14:13 INFO - Starting resource monitoring. 17:14:13 INFO - ##### 17:14:13 INFO - ##### Running install step. 17:14:13 INFO - ##### 17:14:13 INFO - Running pre-action listener: _resource_record_pre_action 17:14:13 INFO - Running main action method: install 17:14:13 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 17:14:13 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 17:14:14 INFO - Reading from file tmpfile_stdout 17:14:14 INFO - Detecting whether we're running mozinstall >=1.0... 17:14:14 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 17:14:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 17:14:14 INFO - Reading from file tmpfile_stdout 17:14:14 INFO - Output received: 17:14:14 INFO - Usage: mozinstall [options] installer 17:14:14 INFO - Options: 17:14:14 INFO - -h, --help show this help message and exit 17:14:14 INFO - -d DEST, --destination=DEST 17:14:14 INFO - Directory to install application into. [default: 17:14:14 INFO - "/builds/slave/test-pgo"] 17:14:14 INFO - --app=APP Application being installed. [default: firefox] 17:14:14 INFO - mkdir: /builds/slave/test-pgo/build/application 17:14:14 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 17:14:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 17:14:30 INFO - Reading from file tmpfile_stdout 17:14:30 INFO - Output received: 17:14:30 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 17:14:30 INFO - Running post-action listener: _resource_record_post_action 17:14:30 INFO - ##### 17:14:30 INFO - ##### Running run-tests step. 17:14:30 INFO - ##### 17:14:30 INFO - Running pre-action listener: _resource_record_pre_action 17:14:30 INFO - Running main action method: run_tests 17:14:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 17:14:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 17:14:30 INFO - Python 2.7.3 17:14:30 INFO - Return code: 0 17:14:30 INFO - grabbing minidump binary from tooltool 17:14:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:14:30 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f28660>, '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 0x1f29560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f29a10>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 17:14:30 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 17:14:30 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 17:14:30 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:14:30 INFO - Return code: 0 17:14:30 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 17:14:30 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 17:14:30 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 17:14:30 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 17:14:30 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 17:14:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 17:14:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 17:14:31 INFO - Return code: 0 17:14:31 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-045', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test-pgo/build 17:14:31 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-045 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log 17:14:31 INFO - Using env: {'DISPLAY': ':0', 17:14:31 INFO - 'HOME': '/home/cltbld', 17:14:31 INFO - 'LANG': 'en_US.UTF-8', 17:14:31 INFO - 'LANGUAGE': 'en_US:en', 17:14:31 INFO - 'LOGNAME': 'cltbld', 17:14:31 INFO - 'MAIL': '/var/mail/cltbld', 17:14:31 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 17:14:31 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 17:14:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:14:31 INFO - 'MOZ_NO_REMOTE': '1', 17:14:31 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 17:14:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:14:31 INFO - 'NO_EM_RESTART': '1', 17:14:31 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:14:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:14:31 INFO - 'PWD': '/builds/slave/test-pgo', 17:14:31 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 17:14:31 INFO - 'SHELL': '/bin/bash', 17:14:31 INFO - 'SHLVL': '1', 17:14:31 INFO - 'TERM': 'linux', 17:14:31 INFO - 'TMOUT': '86400', 17:14:31 INFO - 'USER': 'cltbld', 17:14:31 INFO - 'XDG_SESSION_COOKIE': '1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295', 17:14:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:14:31 INFO - '_': '/tools/buildbot/bin/python'} 17:14:31 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-045', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 17:14:31 INFO - mozversion application_buildid: 20160121143004 17:14:31 INFO - mozversion application_changeset: ebaf5066ddd3c718cc2bd421f340809e6ab6f260 17:14:31 INFO - mozversion application_display_name: Nightly 17:14:31 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:14:31 INFO - mozversion application_name: Firefox 17:14:31 INFO - mozversion application_remotingname: firefox 17:14:31 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 17:14:31 INFO - mozversion application_vendor: Mozilla 17:14:31 INFO - mozversion application_version: 46.0a1 17:14:31 INFO - mozversion platform_buildid: 20160121143004 17:14:31 INFO - mozversion platform_changeset: ebaf5066ddd3c718cc2bd421f340809e6ab6f260 17:14:31 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 17:14:31 INFO - mozversion platform_version: 46.0a1 17:14:31 INFO - using testdate: 1453425271 17:14:31 INFO - actual date: 1453425271 17:14:31 INFO - starting webserver on 'localhost:38782' 17:14:31 INFO - SUITE-START | Running 3 tests 17:14:31 INFO - TEST-START | dromaeo_css 17:14:31 INFO - operating with platform_type : linux_ 17:14:31 INFO - Initialising browser for dromaeo_css test... 17:14:31 INFO - TEST-INFO | started process 27810 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpeSdSXE/profile http://localhost:38782/getInfo.html) 17:14:34 INFO - PROCESS | 27810 | 17:14:34 INFO - PROCESS | 27810 | (process:27894): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 17:14:35 INFO - PROCESS | 27810 | __metrics Screen width/height:1600/1200 17:14:35 INFO - PROCESS | 27810 | colorDepth:24 17:14:35 INFO - PROCESS | 27810 | Browser inner width/height: 1024/697 17:14:35 INFO - PROCESS | 27810 | __metrics 17:14:35 INFO - PROCESS | 27810 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 17:14:36 INFO - TEST-INFO | 27810: exit 0 17:14:36 INFO - Browser initialized. 17:14:36 INFO - Running cycle 1/1 for dromaeo_css test... 17:14:36 INFO - TEST-INFO | started process 27943 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpeSdSXE/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:14:38 INFO - PROCESS | 27943 | 17:14:38 INFO - PROCESS | 27943 | (process:28001): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 17:14:48 INFO - PROCESS | 27943 | RSS: Main: 149102592 17:14:48 INFO - PROCESS | 27943 | 17:15:38 INFO - PROCESS | 27943 | 1453425338189 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] 17:17:46 INFO - PROCESS | 27943 | Cycle 1(1): loaded http://localhost:38782/tests/dromaeo/cssquery-dojo.html (next: http://localhost:38782/tests/dromaeo/cssquery-ext.html) 17:17:48 INFO - PROCESS | 27943 | RSS: Main: 155783168 17:17:48 INFO - PROCESS | 27943 | 17:20:50 INFO - PROCESS | 27943 | Cycle 1(1): loaded http://localhost:38782/tests/dromaeo/cssquery-ext.html (next: http://localhost:38782/tests/dromaeo/cssquery-jquery.html) 17:20:50 INFO - PROCESS | 27943 | RSS: Main: 151859200 17:20:50 INFO - PROCESS | 27943 | 17:23:52 INFO - PROCESS | 27943 | Cycle 1(1): loaded http://localhost:38782/tests/dromaeo/cssquery-jquery.html (next: http://localhost:38782/tests/dromaeo/cssquery-mootools.html) 17:23:53 INFO - PROCESS | 27943 | RSS: Main: 151220224 17:23:53 INFO - PROCESS | 27943 | 17:26:54 INFO - PROCESS | 27943 | Cycle 1(1): loaded http://localhost:38782/tests/dromaeo/cssquery-mootools.html (next: http://localhost:38782/tests/dromaeo/cssquery-prototype.html) 17:26:55 INFO - PROCESS | 27943 | RSS: Main: 149884928 17:26:55 INFO - PROCESS | 27943 | 17:29:57 INFO - PROCESS | 27943 | Cycle 1(1): loaded http://localhost:38782/tests/dromaeo/cssquery-prototype.html (next: http://localhost:38782/tests/dromaeo/cssquery-yui.html) 17:29:58 INFO - PROCESS | 27943 | RSS: Main: 150700032 17:29:58 INFO - PROCESS | 27943 | 17:33:01 INFO - PROCESS | 27943 | Cycle 1(1): loaded http://localhost:38782/tests/dromaeo/cssquery-yui.html (next: http://localhost:38782/tests/dromaeo/cssquery-dojo.html) 17:33:01 INFO - PROCESS | 27943 | RSS: Main: 152784896 17:33:01 INFO - PROCESS | 27943 | 17:33:01 INFO - PROCESS | 27943 | __start_tp_report 17:33:01 INFO - PROCESS | 27943 | _x_x_mozilla_page_load 17:33:01 INFO - PROCESS | 27943 | _x_x_mozilla_page_load_details 17:33:01 INFO - PROCESS | 27943 | |i|pagename|runs| 17:33:01 INFO - PROCESS | 27943 | |0;dojo.html;3096.1640357103583;3123.3909387669387;3136.38840426117;3154.5110507871273;3157.6368717597484;5203.19350500672;5215.791368345262;5218.373795144583;5234.18870075138;5243.370795504536;5108.5146911043485;5234.953009398126;5259.237410575464;5260.395054568726;5310.73446327684;4575.313702944552;4833.806647734086;4972.378452693413;4974.651774375795;5008.799648014094;4757.310190022445;4867.2942423348595;4931.087748766472;4956.107900577895;4962.975185124087;4771.5467030632035;4780.259059845712;4807.591354734852;4836.081144582518;4837.927431088537;4703.7883295251795;4707.741074240916;4722.055588882237;4754.572088512016;4761.761911904391;4673.976630116827;4717.551832575899;4727.361806156159;4764.190087685102;4794.688345257582;5142.125838607446;5161.7161056141895;5183.81856635016;5202.661826981234;5205.609579281531;5688.260526131618;5709.571782116358;5713.714314284269;5718.942810571883;5720.141978703186;5490.69801160936;5556.361018482886;5626.099824028136;5785.392533783935;5800.361960184377;5248.370195576517;5279.70961597112;5316.867078323073;5364.436734142898;5404.83785486436;5747.942520574825;5814.30228372598;5826.329972053268;5863.736131874076;5872.618279811884;5556.888862222814;5566.415526369754;5592.077307244259;5600.0759874620235;5605.859853503695;5423.457654234624;5549.972250138804;5588.86027849307;5674.574406919498;5707.172459993278;5607.607467477237;5607.915881261784;5611.971940140274;5613.831585052455;5618.606697531133;5439.836804895859;5576.163575463632;5577.05190117681;5611.6071874969175;5623.465770751854;4332;4333.241682705514;4394.758288294174;4395;4442.155990361821;3912.8630497933004;3917.373220284741;3921.9607803922167;3950.822213000422;3964.7621142731527;5281.735913204325;5296.523312901857;5315.096433606296;5337.066013447631;5369;5616.803411880564;5646.20953066571;5659.179418984307;5682;5717.62835415705;5360.463953604608;5393.703346315911;5409.29679141709;5409.7295135243085;5412.972935135299;4757.500462451462;4804.495527969513;4811;4871.610271178297;4909.4845041270155;5821.88356232873;5823.097419899922;5832.562557808182;5847.181394604759;5862.882742345215;5565.55475561946;5573.191887176417;5576.581756368208;5582.190582365453;5598.384177740527;5771.047777116896;5771.076627739541;5774.364819869895;5787.045137552257;5787.450192231731;5549.528290095387;5555.666660000413;5591.27313449249;5594.636348637326;5652.88694226105;5671.971640141773;5691.77232910679;5717.885642287048;5737.885242295214;5740.770369185186;5428.6199966002005;5576.581756368208;5585.804496842591;5604.355499117653;5615.129654903497;5429.6199266051;5453.700046497481;5594.440555944373;5612;5659.490645841894;5466.3713672928125;5469.2616496772425;5484.533814625802;5486.6982315973;5511.22842802;5555;5590.720463976866;5593.552515798645;5614;5647.407022262603;5350.090484617702;5430.02259593277;5431.8098866539485;5444.972775136099;5480.260164877691 17:33:01 INFO - PROCESS | 27943 | |1;ext.html;520.180715373287;538.0557122250451;552.4530714592555;558.5559480213232;570.9543236541077;34561.30877382454;35054;35093.64906350936;35114;35117.2976540469;41302.17395652085;41933.11300991455;42039.36940945888;42072.57927420725;42200.78899605505;8684.218420342153;8815.118488151165;8841.734747957571;8873.822523549525;8886.46681199127;8479.06730259674;8635.69775057873;8652.22130008299;8664.523451210212;8681.739547813544;8653.134686531359;8682.6092825823;8692.608832602516;8725.083866194054;8730.738077857643;8643;8682.13178682133;8691.348148888796;8710.259627931602;8718.346124040723;8578.270846978014;8668.219860212548;8675.869861952076;8677.56612169389;8721.12788721129;38443;38626.42060369097;38995;39057;39093;3059.6940305969447;3273.5908011498564;3351.3632409842294;3444.0012396405014;3730.5896351401325;29447.558286625717;29690;30248.24379390511;30364.69635303663;31212.687873121205;3771.113788259784;3785.8296376662843;3852.567133719912;3881.825317860703;3893.007283142809;193428;194397;195062;195657;196504;48787.26819097716;49908.50091499111;55004.174937375974;55176.72411637916;55278.72360638171;59968;60230;60259.69870150621;60292.397076029556;60362;13118.278494682692;13162.670933226746;13225.933870330779;13293.800592991112;13327.400266988008;9403.623855045858;9462.337636365388;9523.90476095244;9524.238060955246;9532.571034303473;18192.090395480172;18431.17059732315;18468.907655461637;18480.521558275304;19258.71111933294;7184.856302873914;7287.417006639456;7389.778306650809;7529.096508418916;7562.827761696945;881.9073997230327;972.9659461918941;984.773502094508;1033.5504055735778;1106.7952428800697;28264.71735282662;28687;28908.855455722587;28912.855435722686;29958.55062174069;1039.0856046678873;1055.2560444886337;1059.9364038157735;1074.5272080284649;1116.2409561498098;14260.151548473568;14268.857311426753;14314;14398.280085995868;14499.710005799825;329098;332379;332681;333365;333601.31189504784;50164.749176253885;51366.22950655743;51401.48598514042;51619;51628.22557661638;1329.926854023038;1338.7590233758017;1346.2326473909973;1360.149906308557;1364.1883079567642;26880.59679104776;28133.43733125367;28179.43641127125;28252;29494.852525737235;42309.36535951902;42784.14431711411;43034.78482607567;43068.35397468978;43182;206516;207386;207951;208173;208850;27617;28316.85841570779;29473.936824422086;30970.535441968837;30982.690173098883;37086.25827483381;37550.24899502049;37637.623623763415;38077.809610951765;38432.615673842905;31362;31497.685023149475;31890.681093189698;32442.837785811866;32462.513062303613;32544;32705.509417358284;32906.341873161924;33569.16077098092;33848.49227261642;32031.199220019687;32326;32419.35161296808;34709;35482.29035419329;28217.858910705316;30726.539101913044;31909.36181276315;32213.838930805196;32344.35311293808;24214.87892560526;24220.87889560541;24506.142285019938;24946.251612451655;25031 17:33:01 INFO - PROCESS | 27943 | |2;jquery.html;365.1546669460199;365.6818567845974;366.1651434728816;366.6278727092001;370.54423059636645;15220.391184352626;16620.25208865601;16675.833241667595;17295.39466118686;17789.822101778995;15086.245687715598;15262.236888155576;15518.146501942389;15583.532494025198;16249.675006499892;4964.702117872921;5096.413912400066;5130.769115389798;5136.203888397305;5140.306058682087;4397.978010109961;4972.154733695281;5055.342805435288;5071.594272458213;5506.256655351516;5057.519535644126;5239.449857764918;5268.025415298163;5387.676739395649;5443.782248710067;5199.350081239845;5224.921626175629;5306;5518.806841760519;5954.077118046666;5343.919841202385;5345.839624811262;5366.785328586851;5375.22059301403;5377.435369286247;14521.927390363086;19570.608587828305;20039.699404508945;20080.29718959844;20191.697124543145;1919.8848069115897;1936.7675878894622;2010.6280338137344;2030.7055476955907;2198.4393979535275;9439.150476457151;9723.805523889483;9769.316147869651;10535.73660658482;13025;1779.030428416516;1798.8021317655048;1800.9459716208535;1828.570285982793;1862.5622978600154;49196;49938;49980.75009624965;54464.18303725447;56194.43805561933;9657.951710241545;9919.256055795844;10074.899251007542;10075.143612792848;10094.747631309276;12859.099863009687;13111;13113.934430327978;13138.605841824761;13160.078794484485;6550.312217217219;6617.305182955721;6649.268580456146;6666.799996000128;6708.19501659804;5928.614640048383;6095.603785753912;6114.991026480581;6125.9693701531205;6165.784197553064;3988.441618173458;4040.010197501631;4405.911881762347;4467.508574056851;4476.6418686505;1728;1778.7331900214813;1789.74943507909;1810.3482746211353;1825.703750337249;898.1063841477771;902.5532361480978;950.7242899559051;1006.2151521812998;1006.6778630838207;15502.9224853875;15781.28984195714;15820.604484887739;16231.51305460838;16290.837091628931;873.0701802580231;916.0930678628243;933.5145724223365;939.0984654731534;949.6248981652209;6103.450689437883;8740.694075707319;9055.003949565542;9383.718488445358;9482.573284202228;520000;524046;528381;545588;549453;69790.3020969794;73182;73691.63154184195;73692.63153684197;74910;1094.0645747885444;1106.4744246483017;1116.9162312826409;1117.944102794857;1118.1502058435647;15003.849961500246;15052.54842354731;15148.469803556822;15348.155851427831;15723.764143538085;32908.50637240396;33072;33240.33519329648;33976.66023339735;34441;41301.79349103235;41770.37344439775;44477.55522444864;45093.774531127136;47157.76421117873;6804.829879253059;7005.719771209095;7030.859382812418;7033.613151276524;7091.1490621125795;3484.1463841359027;6520.217573891164;7186.496945213785;8919.866202006846;10878.945605271923;8986.32602554798;9084.40951338161;9172.816543668956;9254.583543740413;9481.431114133175;3136.7176954074243;4123.969007748063;8887.15572020657;8893.155150260714;9295.907040929504;9124.863127053231;9283.814323713354;9357.485338306185;9377.156055954723;9498.38260513092;7206.747763828241;7218.097737782778;7330.96334518324;7384.335409813142;7403.5928023959195;8217.95891020541;9353.766155846159;9699.70900872975;9756.317057806169;9866.309358344846 17:33:01 INFO - PROCESS | 27943 | |3;mootools.html;1431.7494438473268;1481.052126638951;1617.6117731744384;1748.1783561725983;1775.4496106207068;7727.884081738772;7891.9210807891905;7978.082520510143;7983.4810737302105;8031;7773.572453515055;7778.611069446519;7852.411069169807;7886.369090472763;7893.210678932118;2374.9406264843387;2382.8451150675237;2384.6899903012586;2397.508510755291;2398.20859116492;2364.8935797889135;2385.3678775124604;2385.6660067590465;2394.6288325309606;2411.131992482705;2300.861948283108;2365.3731761083327;2371.893264803088;2372.810175185981;2388.319328991238;2369.644553316999;2411.0476361837063;2426.6723992261172;2438.426969662137;2438.8658623775686;2405.518896220763;2409.8674572898485;2419.4677171022345;2419.903203871843;2425.890834912433;7760.495567788075;7887.881681774778;7889.763307100796;7948.443608947376;7949.64226609804;4797.328374027639;4983.177775667011;4992.650514463989;4999.850004499871;5011.423686276088;3037.817730936151;3079.245584831708;3120.5007198848075;3126.421612001764;3137.7332926701256;1075.8601381820392;1082.426314053545;1099.2085698297212;1103.5254840418618;1117.3742704085737;10942.288751231225;10984.615538456115;11032.338059716443;11047.502862371213;11059.778804423948;4278.165757677285;4354.760488173118;4450.532694067141;4531.617856553717;4540.8637740867825;8922.420042697333;8958.462492250486;8965.237954773787;8974.057723939022;8984.8652270216;4901.607871370282;4916.631252656065;4922.630802689812;4933.01339732055;4963.5036496350795;4458.929856834401;4497.977510112494;4528.184926713223;4535.229011068126;4543.045960348298;3517.067976986101;3569.39320315547;3591.44332628443;3598.8020658864016;3611.5666120065234;1081.3619964221148;1090.220492347975;1097.35804554335;1105.2926127278547;1150.9654710358702;1310.737852429518;1311.5540716156552;1314.737052589486;1321.682796128922;1347.9326033698276;7265.745698900513;7279.272072792678;7375.631218439056;7382.298681625237;7383.2616738326815;1086.8641419822522;1110.1618278199908;1115.8605174353206;1120.0479592346603;1153.0832987774738;5821.79623713168;5873.911891321633;5884.293884733859;5887.793927212612;5914.940850591439;9171.77070573241;9361;9454.716358509255;9456.621735130519;9576.425414475154;9300.581473833558;9303.813923721624;9304.302177336727;9329.16037556623;9348.20540254086;7307.269273072757;7464.813379665443;7473.588952607659;7480.513766605153;7514.473986820979;7415.036045314075;7428.071491063617;7523.811904702427;7528.171901090766;7574.3183113520045;8426;8553.31573474133;8587;8591.398602097794;8642.611082501176;8574.442661227;8718.869216961877;8772.473651580925;8798;8837.718530813125;7091.184513780775;7184.568925864465;7198.640067996684;7217.963910180625;7224.566526008456;7506.474546781891;7603.923960760321;7607.125180604301;7632.656530456032;7647.88528172089;6384.968075159594;7303.707851685873;7323.2676732326345;7373.963130184315;7537.849243015218;7022.964885175541;7105;7114.430845532242;7198.5680859148615;7236.34872861445;6921.826954326182;7058.188308344606;7091.9290807091265;7096.574205547684;7103.680334385069;6097.939020609737;6144.56988010835;6163.691815409301;6187.319394866651;6195.81412557624;6484.740610375532;6589.7364105435245;6597.0764093026055;6618.404343609098;6628.933710662832 17:33:01 INFO - PROCESS | 27943 | |4;prototype.html;343.22088858291664;349.56304619225966;350.6826322178428;351.1467134862285;358.5661349766783;6139.72371243294;6172.105044768506;6215.968920155398;6249.718762655686;6356.110144579751;6199.566030377864;6210.65841378724;6231.376862313767;6233.750649974007;6241.906371404421;4706.576408123268;4717.9056418871605;4718.97640511797;4720.881977950561;4748.335233067373;4743.525647435264;4750.073735621555;4762.928556071662;4769.499202583731;4775.379200703921;4580.0610874770755;4606.239970404896;4619.053094115715;4661.067786442708;4665.76671166442;4650.116477869228;4654.232051711463;4699.177643912336;4700.31845382421;4708.764561771898;4096.856610018635;4106.178764247133;4106.979465102685;4115.42384066231;4116.464859568267;5881.9705901470215;5915.733791979371;5925.229720136398;5930.080837470199;5938.881222375571;5426.810061647863;5480.945190548084;5481.095619222823;5516.779328826842;5523.226748255248;6592.538522303441;6592.901106483407;6594.109795177686;6594.472442204612;6621.933780662228;4525.208088584484;4545.250033744428;4559.202139625552;4574.931376029363;4575.931361029554;6805.2173999989645;6871.759488417932;6938.23679395261;6945.305469453065;6952.339527744856;4683.531646835358;4695.7886895089805;4701.435827700698;4703.741294228782;4707.95292047082;4737.749568954719;4746.311784791255;4756.7859446325;4760.071786001697;4777.784999675023;5508.256385387921;5518.91721624176;5521.779128834882;5522.779088836482;5528.226048353234;6582.210134783857;6618.801435956929;6665.466762658975;6680.365365290289;6687.398134167948;1673.355758033166;1696.1180186303054;1696.3384280130758;1697.3974239145173;1697.4822679082997;1104.5913012185542;1110.4780753046055;1115.4645770030431;1122.1359553144196;1127.5940661361903;6317.368263173646;6318.526110541728;6326.588771729823;6336.017917222838;6341.175647165931;6844.28135045823;6849.04113424121;6851.760188393382;6855.07456493377;6862.279460656559;6192.442680158807;6273.059041143773;6305.432511074026;6308.0537919311555;6324.810255692337;3679.79761113136;3696.094456858087;3698.7595806272507;3708.369577171887;3722.7766334020043;7181.605011724301;7194.676239569232;7205.423566114699;7266.1280646322775;7275.67259473325;6895.482838787111;7003.999999999898;7017.157941047107;7023.403010744144;7061.752838650623;7199.460040496983;7213.639318034077;7221.4583906207245;7238.27617238272;7272.527285726411;6896.137982752156;6912.205096413775;6920.7231710731;6923.446124310144;6924.58452492852;6692.364225398579;6834.350736680008;6839.384455399038;6842.623655698984;6848.417884479875;7198.244184360776;7240.348368646847;7247.601381924045;7253.528520646141;7264.67308971087;4812.735299558418;4859.125357435695;4863.659543831898;4872.8294509693405;4873.95126048735;6768.9661551691925;6884.001819736211;6927.099477067949;6972.233054363915;6976.6860491277;6772.661366931535;6773.593584384953;6775.525713200029;6779.593224406552;6780.118584583973;6608.70260838273;6680.298568650416;6706;6713.462922966249;6726.226483954212;6646.335366463315;6707;6711.865762684816;6722.394984451423;6734.764283250062;6716.932830671631;6726.764563240263;6788.59268443895;6792.150981127359;6812.182538095461;6487.18910136233;6583.769568065095;6631.469482441296;6640;6641.933580664325 17:33:01 INFO - PROCESS | 27943 | |5;yui.html;701.7263267325742;754.4643303254688;816.9632366543505;839.1314988986398;858.5363903492115;12998.155119917199;13186.802197967027;15428.69142617147;15740.055596664208;15770.921145394286;12517.561885334015;12661.746765064716;12686.238825670467;12747;12748.617541473748;790.0716657926941;795.7214974758846;798.7723498802842;802.2659266770897;802.3581135091932;794.5351969098056;797.1948332184478;803.2048272210499;805.556943680976;811.926926576608;820.9876851847197;823.0987069159261;829.2329595124486;831.7754206364278;831.9792005199888;818.1409520003972;823.2138307915926;826.2274773087123;827.0736774812219;828.5981299069946;612.4916319454842;612.8958077126899;613.2732711736562;613.7759717703051;613.9785107521216;14029.228392438412;14072;14128.152310861382;14171.929140354336;14179.361928713233;12709.618711438672;12729.681757956032;12884.484620615163;12895.613131606067;12977.221366718028;10276.091990737004;10428.843567346496;10701.46492675371;10879.93777764479;10995.285306455055;3513.104158439607;3561.8397172127056;3577.8926632201074;3668.4680721295263;3670.834812433447;47651.52348476506;47980.280295795594;48013.51986480125;48166.51833481655;48267.51732482701;8330.208630180123;8511.787205319917;8843.867341989875;9165.541722913827;9268.073192680678;16789.832101679072;16816.24326905292;16838.158092095346;16843.57891052709;16852.915735421244;7182.7126914923865;7286;7412.221716719775;7463;7630.313271805564;4030.375291829771;4122.175564887035;4199.811008504625;4203.390508376268;4399;3036.6356037275227;3077.9076627701206;3081.245094951751;3096.2259435141214;3099.8915037974016;542.8588566972616;549.609777058293;554.4787899374575;558.4025093150372;566.4081035318103;569.9173619825185;642.8489305013318;643.5141468191486;673.3333999340715;725.760499035317;8715.128487151234;8782.648694052294;8848.601812918305;8926.464412135292;8949.284057275403;563.2199403825649;654.5287393076977;661.3915198017739;689.0835189198355;707.0532022875169;3742.4947632069866;4006.8797936061965;4180;4247.235497610398;4247.681423893158;56110.15834762482;56158.43841561614;56587;57711.71144144252;58681.70659146762;51575.74212128916;52039.21941170885;52092.21861672078;52122.47877521176;52543.211851822256;22184.556308874056;22249.555008900054;36630;47277;47858.76070619694;8252.33981281484;8282.782895229488;8432.241098301183;8474.237318641352;8485.872711909204;33378.66621333756;33398.33203335871;33546.496802547495;34038.48942265918;34179.14552136217;41260.1747965045;41323.793381032905;42795.86449626065;43339.56660433355;43365.34951975786;9735.951320243354;9833.360831545926;9988.35075720105;10113.49432528356;10234.846477302995;10947.178961578073;10986.945065274622;11010.284331518425;11105.777884442105;11126.165537584875;10353.896461035294;10434.895651043393;10446.791064178826;10514.316569422963;10737.838932415863;10698.304610200312;11018.724531886766;11146.442677866236;11351.262167959056;11481.82777258325;10428.322159059637;10619.256652034283;10621.628243011457;10721.35671859691;10968.561257549927;8662.480251184948;9036.638534458549;9272.72181834546;9295.535223238676;9332.25341972627;8413.158684131538;8600.440971336842;8631.13688631157;9156.118564991948;9252.306077044113 17:33:01 INFO - PROCESS | 27943 | __end_tp_report 17:33:01 INFO - PROCESS | 27943 | __start_cc_report 17:33:01 INFO - PROCESS | 27943 | _x_x_mozilla_cycle_collect,315 17:33:01 INFO - PROCESS | 27943 | __end_cc_report 17:33:01 INFO - PROCESS | 27943 | __startTimestamp1453426381250__endTimestamp 17:33:01 INFO - PROCESS | 27943 | 17:33:01 INFO - PROCESS | 27943 | ------- Summary: start ------- 17:33:01 INFO - PROCESS | 27943 | Number of tests: 6 17:33:01 INFO - PROCESS | 27943 | 17:33:01 INFO - PROCESS | 27943 | [#0] dojo.html Cycles:165 Average:5251.98 Median:5444.97 stddev:581.06 (10.7%) stddev-sans-first:557.69 17:33:01 INFO - PROCESS | 27943 | Values: 3096.2 3123.4 3136.4 3154.5 3157.6 5203.2 5215.8 5218.4 5234.2 5243.4 5108.5 5235.0 5259.2 5260.4 5310.7 4575.3 4833.8 4972.4 4974.7 5008.8 4757.3 4867.3 4931.1 4956.1 4963.0 4771.5 4780.3 4807.6 4836.1 4837.9 4703.8 4707.7 4722.1 4754.6 4761.8 4674.0 4717.6 4727.4 4764.2 4794.7 5142.1 5161.7 5183.8 5202.7 5205.6 5688.3 5709.6 5713.7 5718.9 5720.1 5490.7 5556.4 5626.1 5785.4 5800.4 5248.4 5279.7 5316.9 5364.4 5404.8 5747.9 5814.3 5826.3 5863.7 5872.6 5556.9 5566.4 5592.1 5600.1 5605.9 5423.5 5550.0 5588.9 5674.6 5707.2 5607.6 5607.9 5612.0 5613.8 5618.6 5439.8 5576.2 5577.1 5611.6 5623.5 4332.0 4333.2 4394.8 4395.0 4442.2 3912.9 3917.4 3922.0 3950.8 3964.8 5281.7 5296.5 5315.1 5337.1 5369.0 5616.8 5646.2 5659.2 5682.0 5717.6 5360.5 5393.7 5409.3 5409.7 5413.0 4757.5 4804.5 4811.0 4871.6 4909.5 5821.9 5823.1 5832.6 5847.2 5862.9 5565.6 5573.2 5576.6 5582.2 5598.4 5771.0 5771.1 5774.4 5787.0 5787.5 5549.5 5555.7 5591.3 5594.6 5652.9 5672.0 5691.8 5717.9 5737.9 5740.8 5428.6 5576.6 5585.8 5604.4 5615.1 5429.6 5453.7 5594.4 5612.0 5659.5 5466.4 5469.3 5484.5 5486.7 5511.2 5555.0 5590.7 5593.6 5614.0 5647.4 5350.1 5430.0 5431.8 5445.0 5480.3 17:33:01 INFO - PROCESS | 27943 | 17:33:01 INFO - PROCESS | 27943 | [#1] ext.html Cycles:180 Average:41229.45 Median:34881.50 stddev:66157.26 (189.7%) stddev-sans-first:66272.24 17:33:01 INFO - PROCESS | 27943 | Values: 520.2 538.1 552.5 558.6 571.0 34561.3 35054.0 35093.6 35114.0 35117.3 41302.2 41933.1 42039.4 42072.6 42200.8 8684.2 8815.1 8841.7 8873.8 8886.5 8479.1 8635.7 8652.2 8664.5 8681.7 8653.1 8682.6 8692.6 8725.1 8730.7 8643.0 8682.1 8691.3 8710.3 8718.3 8578.3 8668.2 8675.9 8677.6 8721.1 38443.0 38626.4 38995.0 39057.0 39093.0 3059.7 3273.6 3351.4 3444.0 3730.6 29447.6 29690.0 30248.2 30364.7 31212.7 3771.1 3785.8 3852.6 3881.8 3893.0 193428.0 194397.0 195062.0 195657.0 196504.0 48787.3 49908.5 55004.2 55176.7 55278.7 59968.0 60230.0 60259.7 60292.4 60362.0 13118.3 13162.7 13225.9 13293.8 13327.4 9403.6 9462.3 9523.9 9524.2 9532.6 18192.1 18431.2 18468.9 18480.5 19258.7 7184.9 7287.4 7389.8 7529.1 7562.8 881.9 973.0 984.8 1033.6 1106.8 28264.7 28687.0 28908.9 28912.9 29958.6 1039.1 1055.3 1059.9 1074.5 1116.2 14260.2 14268.9 14314.0 14398.3 14499.7 329098.0 332379.0 332681.0 333365.0 333601.3 50164.7 51366.2 51401.5 51619.0 51628.2 1329.9 1338.8 1346.2 1360.1 1364.2 26880.6 28133.4 28179.4 28252.0 29494.9 42309.4 42784.1 43034.8 43068.4 43182.0 206516.0 207386.0 207951.0 208173.0 208850.0 27617.0 28316.9 29473.9 30970.5 30982.7 37086.3 37550.2 37637.6 38077.8 38432.6 31362.0 31497.7 31890.7 32442.8 32462.5 32544.0 32705.5 32906.3 33569.2 33848.5 32031.2 32326.0 32419.4 34709.0 35482.3 28217.9 30726.5 31909.4 32213.8 32344.4 24214.9 24220.9 24506.1 24946.3 25031.0 17:33:01 INFO - PROCESS | 27943 | 17:33:01 INFO - PROCESS | 27943 | [#2] jquery.html Cycles:180 Average:26917.31 Median:5113.59 stddev:87218.82 (1705.6%) stddev-sans-first:87440.71 17:33:01 INFO - PROCESS | 27943 | Values: 365.2 365.7 366.2 366.6 370.5 15220.4 16620.3 16675.8 17295.4 17789.8 15086.2 15262.2 15518.1 15583.5 16249.7 4964.7 5096.4 5130.8 5136.2 5140.3 4398.0 4972.2 5055.3 5071.6 5506.3 5057.5 5239.4 5268.0 5387.7 5443.8 5199.4 5224.9 5306.0 5518.8 5954.1 5343.9 5345.8 5366.8 5375.2 5377.4 14521.9 19570.6 20039.7 20080.3 20191.7 1919.9 1936.8 2010.6 2030.7 2198.4 9439.2 9723.8 9769.3 10535.7 13025.0 1779.0 1798.8 1800.9 1828.6 1862.6 49196.0 49938.0 49980.8 54464.2 56194.4 9658.0 9919.3 10074.9 10075.1 10094.7 12859.1 13111.0 13113.9 13138.6 13160.1 6550.3 6617.3 6649.3 6666.8 6708.2 5928.6 6095.6 6115.0 6126.0 6165.8 3988.4 4040.0 4405.9 4467.5 4476.6 1728.0 1778.7 1789.7 1810.3 1825.7 898.1 902.6 950.7 1006.2 1006.7 15502.9 15781.3 15820.6 16231.5 16290.8 873.1 916.1 933.5 939.1 949.6 6103.5 8740.7 9055.0 9383.7 9482.6 520000.0 524046.0 528381.0 545588.0 549453.0 69790.3 73182.0 73691.6 73692.6 74910.0 1094.1 1106.5 1116.9 1117.9 1118.2 15003.8 15052.5 15148.5 15348.2 15723.8 32908.5 33072.0 33240.3 33976.7 34441.0 41301.8 41770.4 44477.6 45093.8 47157.8 6804.8 7005.7 7030.9 7033.6 7091.1 3484.1 6520.2 7186.5 8919.9 10878.9 8986.3 9084.4 9172.8 9254.6 9481.4 3136.7 4124.0 8887.2 8893.2 9295.9 9124.9 9283.8 9357.5 9377.2 9498.4 7206.7 7218.1 7331.0 7384.3 7403.6 8218.0 9353.8 9699.7 9756.3 9866.3 17:33:01 INFO - PROCESS | 27943 | 17:33:01 INFO - PROCESS | 27943 | [#3] mootools.html Cycles:180 Average:5567.30 Median:6121.25 stddev:2837.44 (46.4%) stddev-sans-first:2828.37 17:33:01 INFO - PROCESS | 27943 | Values: 1431.7 1481.1 1617.6 1748.2 1775.4 7727.9 7891.9 7978.1 7983.5 8031.0 7773.6 7778.6 7852.4 7886.4 7893.2 2374.9 2382.8 2384.7 2397.5 2398.2 2364.9 2385.4 2385.7 2394.6 2411.1 2300.9 2365.4 2371.9 2372.8 2388.3 2369.6 2411.0 2426.7 2438.4 2438.9 2405.5 2409.9 2419.5 2419.9 2425.9 7760.5 7887.9 7889.8 7948.4 7949.6 4797.3 4983.2 4992.7 4999.9 5011.4 3037.8 3079.2 3120.5 3126.4 3137.7 1075.9 1082.4 1099.2 1103.5 1117.4 10942.3 10984.6 11032.3 11047.5 11059.8 4278.2 4354.8 4450.5 4531.6 4540.9 8922.4 8958.5 8965.2 8974.1 8984.9 4901.6 4916.6 4922.6 4933.0 4963.5 4458.9 4498.0 4528.2 4535.2 4543.0 3517.1 3569.4 3591.4 3598.8 3611.6 1081.4 1090.2 1097.4 1105.3 1151.0 1310.7 1311.6 1314.7 1321.7 1347.9 7265.7 7279.3 7375.6 7382.3 7383.3 1086.9 1110.2 1115.9 1120.0 1153.1 5821.8 5873.9 5884.3 5887.8 5914.9 9171.8 9361.0 9454.7 9456.6 9576.4 9300.6 9303.8 9304.3 9329.2 9348.2 7307.3 7464.8 7473.6 7480.5 7514.5 7415.0 7428.1 7523.8 7528.2 7574.3 8426.0 8553.3 8587.0 8591.4 8642.6 8574.4 8718.9 8772.5 8798.0 8837.7 7091.2 7184.6 7198.6 7218.0 7224.6 7506.5 7603.9 7607.1 7632.7 7647.9 6385.0 7303.7 7323.3 7374.0 7537.8 7023.0 7105.0 7114.4 7198.6 7236.3 6921.8 7058.2 7091.9 7096.6 7103.7 6097.9 6144.6 6163.7 6187.3 6195.8 6484.7 6589.7 6597.1 6618.4 6628.9 17:33:01 INFO - PROCESS | 27943 | 17:33:01 INFO - PROCESS | 27943 | [#4] prototype.html Cycles:180 Average:5568.63 Median:6289.25 stddev:1699.89 (27.0%) stddev-sans-first:1658.80 17:33:01 INFO - PROCESS | 27943 | Values: 343.2 349.6 350.7 351.1 358.6 6139.7 6172.1 6216.0 6249.7 6356.1 6199.6 6210.7 6231.4 6233.8 6241.9 4706.6 4717.9 4719.0 4720.9 4748.3 4743.5 4750.1 4762.9 4769.5 4775.4 4580.1 4606.2 4619.1 4661.1 4665.8 4650.1 4654.2 4699.2 4700.3 4708.8 4096.9 4106.2 4107.0 4115.4 4116.5 5882.0 5915.7 5925.2 5930.1 5938.9 5426.8 5480.9 5481.1 5516.8 5523.2 6592.5 6592.9 6594.1 6594.5 6621.9 4525.2 4545.3 4559.2 4574.9 4575.9 6805.2 6871.8 6938.2 6945.3 6952.3 4683.5 4695.8 4701.4 4703.7 4708.0 4737.7 4746.3 4756.8 4760.1 4777.8 5508.3 5518.9 5521.8 5522.8 5528.2 6582.2 6618.8 6665.5 6680.4 6687.4 1673.4 1696.1 1696.3 1697.4 1697.5 1104.6 1110.5 1115.5 1122.1 1127.6 6317.4 6318.5 6326.6 6336.0 6341.2 6844.3 6849.0 6851.8 6855.1 6862.3 6192.4 6273.1 6305.4 6308.1 6324.8 3679.8 3696.1 3698.8 3708.4 3722.8 7181.6 7194.7 7205.4 7266.1 7275.7 6895.5 7004.0 7017.2 7023.4 7061.8 7199.5 7213.6 7221.5 7238.3 7272.5 6896.1 6912.2 6920.7 6923.4 6924.6 6692.4 6834.4 6839.4 6842.6 6848.4 7198.2 7240.3 7247.6 7253.5 7264.7 4812.7 4859.1 4863.7 4872.8 4874.0 6769.0 6884.0 6927.1 6972.2 6976.7 6772.7 6773.6 6775.5 6779.6 6780.1 6608.7 6680.3 6706.0 6713.5 6726.2 6646.3 6707.0 6711.9 6722.4 6734.8 6716.9 6726.8 6788.6 6792.2 6812.2 6487.2 6583.8 6631.5 6640.0 6641.9 17:33:01 INFO - PROCESS | 27943 | 17:33:01 INFO - PROCESS | 27943 | [#5] yui.html Cycles:180 Average:13233.88 Median:48217.02 stddev:15396.15 (31.9%) stddev-sans-first:15410.58 17:33:01 INFO - PROCESS | 27943 | Values: 701.7 754.5 817.0 839.1 858.5 12998.2 13186.8 15428.7 15740.1 15770.9 12517.6 12661.7 12686.2 12747.0 12748.6 790.1 795.7 798.8 802.3 802.4 794.5 797.2 803.2 805.6 811.9 821.0 823.1 829.2 831.8 832.0 818.1 823.2 826.2 827.1 828.6 612.5 612.9 613.3 613.8 614.0 14029.2 14072.0 14128.2 14171.9 14179.4 12709.6 12729.7 12884.5 12895.6 12977.2 10276.1 10428.8 10701.5 10879.9 10995.3 3513.1 3561.8 3577.9 3668.5 3670.8 47651.5 47980.3 48013.5 48166.5 48267.5 8330.2 8511.8 8843.9 9165.5 9268.1 16789.8 16816.2 16838.2 16843.6 16852.9 7182.7 7286.0 7412.2 7463.0 7630.3 4030.4 4122.2 4199.8 4203.4 4399.0 3036.6 3077.9 3081.2 3096.2 3099.9 542.9 549.6 554.5 558.4 566.4 569.9 642.8 643.5 673.3 725.8 8715.1 8782.6 8848.6 8926.5 8949.3 563.2 654.5 661.4 689.1 707.1 3742.5 4006.9 4180.0 4247.2 4247.7 56110.2 56158.4 56587.0 57711.7 58681.7 51575.7 52039.2 52092.2 52122.5 52543.2 22184.6 22249.6 36630.0 47277.0 47858.8 8252.3 8282.8 8432.2 8474.2 8485.9 33378.7 33398.3 33546.5 34038.5 34179.1 41260.2 41323.8 42795.9 43339.6 43365.3 9736.0 9833.4 9988.4 10113.5 10234.8 10947.2 10986.9 11010.3 11105.8 11126.2 10353.9 10434.9 10446.8 10514.3 10737.8 10698.3 11018.7 11146.4 11351.3 11481.8 10428.3 10619.3 10621.6 10721.4 10968.6 8662.5 9036.6 9272.7 9295.5 9332.3 8413.2 8600.4 8631.1 9156.1 9252.3 17:33:01 INFO - PROCESS | 27943 | -------- Summary: end -------- 17:33:01 INFO - PROCESS | 27943 | 17:33:01 INFO - TEST-INFO | 27943: exit 0 17:33:01 INFO - TEST-OK | dromaeo_css | took 1110293ms 17:33:01 INFO - TEST-START | kraken 17:33:01 INFO - operating with platform_type : linux_ 17:33:01 INFO - Initialising browser for kraken test... 17:33:01 INFO - TEST-INFO | started process 28188 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp0fJ8jP/profile http://localhost:38782/getInfo.html) 17:33:05 INFO - PROCESS | 28188 | 17:33:05 INFO - PROCESS | 28188 | (process:28261): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 17:33:05 INFO - PROCESS | 28188 | __metrics Screen width/height:1600/1200 17:33:05 INFO - PROCESS | 28188 | colorDepth:24 17:33:05 INFO - PROCESS | 28188 | Browser inner width/height: 1024/697 17:33:05 INFO - PROCESS | 28188 | __metrics 17:33:05 INFO - PROCESS | 28188 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 17:33:06 INFO - TEST-INFO | 28188: exit 0 17:33:06 INFO - Browser initialized. 17:33:06 INFO - Running cycle 1/1 for kraken test... 17:33:06 INFO - TEST-INFO | started process 28311 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp0fJ8jP/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:33:08 INFO - PROCESS | 28311 | 17:33:08 INFO - PROCESS | 28311 | (process:28368): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 17:33:18 INFO - PROCESS | 28311 | RSS: Main: 149458944 17:33:18 INFO - PROCESS | 28311 | 17:33:21 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:38782/tests/kraken/driver.html?testName=audio-beat-detection) 17:33:21 INFO - PROCESS | 28311 | RSS: Main: 151498752 17:33:21 INFO - PROCESS | 28311 | 17:33:24 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:38782/tests/kraken/driver.html?testName=audio-dft) 17:33:25 INFO - PROCESS | 28311 | RSS: Main: 154513408 17:33:25 INFO - PROCESS | 28311 | 17:33:27 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:38782/tests/kraken/driver.html?testName=audio-fft) 17:33:28 INFO - PROCESS | 28311 | RSS: Main: 146718720 17:33:28 INFO - PROCESS | 28311 | 17:33:30 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:38782/tests/kraken/driver.html?testName=audio-oscillator) 17:33:31 INFO - PROCESS | 28311 | RSS: Main: 146784256 17:33:31 INFO - PROCESS | 28311 | 17:33:33 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:38782/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:33:34 INFO - PROCESS | 28311 | RSS: Main: 147341312 17:33:34 INFO - PROCESS | 28311 | 17:33:37 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:38782/tests/kraken/driver.html?testName=imaging-darkroom) 17:33:37 INFO - PROCESS | 28311 | RSS: Main: 148783104 17:33:37 INFO - PROCESS | 28311 | 17:33:41 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:38782/tests/kraken/driver.html?testName=imaging-desaturate) 17:33:41 INFO - PROCESS | 28311 | RSS: Main: 147304448 17:33:41 INFO - PROCESS | 28311 | 17:33:44 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:38782/tests/kraken/driver.html?testName=json-parse-financial) 17:33:45 INFO - PROCESS | 28311 | RSS: Main: 149913600 17:33:45 INFO - PROCESS | 28311 | 17:33:46 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:38782/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:33:47 INFO - PROCESS | 28311 | RSS: Main: 150011904 17:33:47 INFO - PROCESS | 28311 | 17:33:49 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:38782/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:33:49 INFO - PROCESS | 28311 | RSS: Main: 149831680 17:33:49 INFO - PROCESS | 28311 | 17:33:51 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:38782/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:33:52 INFO - PROCESS | 28311 | RSS: Main: 149839872 17:33:52 INFO - PROCESS | 28311 | 17:33:54 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:38782/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:33:55 INFO - PROCESS | 28311 | RSS: Main: 150147072 17:33:55 INFO - PROCESS | 28311 | 17:33:57 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:38782/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:33:58 INFO - PROCESS | 28311 | RSS: Main: 150921216 17:33:58 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | Cycle 1(1): loaded http://localhost:38782/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:38782/tests/kraken/driver.html?testName=ai-astar) 17:34:00 INFO - PROCESS | 28311 | RSS: Main: 150761472 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | __start_tp_report 17:34:00 INFO - PROCESS | 28311 | _x_x_mozilla_page_load 17:34:00 INFO - PROCESS | 28311 | _x_x_mozilla_page_load_details 17:34:00 INFO - PROCESS | 28311 | |i|pagename|runs| 17:34:00 INFO - PROCESS | 28311 | |0;ai-astar;111;105;111;111;112;122;110;109;109;111 17:34:00 INFO - PROCESS | 28311 | |1;audio-beat-detection;150;134;149;165;126;152;160;137;171;130 17:34:00 INFO - PROCESS | 28311 | |2;audio-dft;164;163;162;163;161;163;165;168;166;163 17:34:00 INFO - PROCESS | 28311 | |3;audio-fft;73;77;76;76;72;74;155;73;76;74 17:34:00 INFO - PROCESS | 28311 | |4;audio-oscillator;96;96;143;96;95;96;145;95;96;134 17:34:00 INFO - PROCESS | 28311 | |5;imaging-gaussian-blur;109;109;109;110;110;110;109;110;110;110 17:34:00 INFO - PROCESS | 28311 | |6;imaging-darkroom;146;149;147;147;146;146;146;148;146;147 17:34:00 INFO - PROCESS | 28311 | |7;imaging-desaturate;97;97;96;97;97;97;97;96;95;95 17:34:00 INFO - PROCESS | 28311 | |8;json-parse-financial;59;60;62;59;59;59;59;60;67;57 17:34:00 INFO - PROCESS | 28311 | |9;json-stringify-tinderbox;68;67;69;68;68;68;67;67;73;68 17:34:00 INFO - PROCESS | 28311 | |10;stanford-crypto-aes;82;84;91;84;84;83;83;81;82;87 17:34:00 INFO - PROCESS | 28311 | |11;stanford-crypto-ccm;119;124;128;114;128;114;123;122;126;132 17:34:00 INFO - PROCESS | 28311 | |12;stanford-crypto-pbkdf2;132;141;141;138;141;129;142;138;142;151 17:34:00 INFO - PROCESS | 28311 | |13;stanford-crypto-sha256-iterative;67;67;65;70;67;66;65;66;65;66 17:34:00 INFO - PROCESS | 28311 | __end_tp_report 17:34:00 INFO - PROCESS | 28311 | __start_cc_report 17:34:00 INFO - PROCESS | 28311 | _x_x_mozilla_cycle_collect,740 17:34:00 INFO - PROCESS | 28311 | __end_cc_report 17:34:00 INFO - PROCESS | 28311 | __startTimestamp1453426440479__endTimestamp 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | ------- Summary: start ------- 17:34:00 INFO - PROCESS | 28311 | Number of tests: 14 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#0] ai-astar Cycles:10 Average:111.10 Median:111.00 stddev:4.31 (3.9%) stddev-sans-first:4.57 17:34:00 INFO - PROCESS | 28311 | Values: 111.0 105.0 111.0 111.0 112.0 122.0 110.0 109.0 109.0 111.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#1] audio-beat-detection Cycles:10 Average:147.40 Median:151.00 stddev:15.29 (10.1%) stddev-sans-first:16.19 17:34:00 INFO - PROCESS | 28311 | Values: 150.0 134.0 149.0 165.0 126.0 152.0 160.0 137.0 171.0 130.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#2] audio-dft Cycles:10 Average:163.80 Median:163.50 stddev:2.04 (1.3%) stddev-sans-first:2.17 17:34:00 INFO - PROCESS | 28311 | Values: 164.0 163.0 162.0 163.0 161.0 163.0 165.0 168.0 166.0 163.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#3] audio-fft Cycles:10 Average:82.60 Median:75.00 stddev:25.49 (34.0%) stddev-sans-first:26.80 17:34:00 INFO - PROCESS | 28311 | Values: 73.0 77.0 76.0 76.0 72.0 74.0 155.0 73.0 76.0 74.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#4] audio-oscillator Cycles:10 Average:109.20 Median:96.00 stddev:21.89 (22.8%) stddev-sans-first:22.69 17:34:00 INFO - PROCESS | 28311 | Values: 96.0 96.0 143.0 96.0 95.0 96.0 145.0 95.0 96.0 134.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#5] imaging-gaussian-blur Cycles:10 Average:109.60 Median:110.00 stddev:0.52 (0.5%) stddev-sans-first:0.50 17:34:00 INFO - PROCESS | 28311 | Values: 109.0 109.0 109.0 110.0 110.0 110.0 109.0 110.0 110.0 110.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#6] imaging-darkroom Cycles:10 Average:146.80 Median:147.00 stddev:1.03 (0.7%) stddev-sans-first:1.05 17:34:00 INFO - PROCESS | 28311 | Values: 146.0 149.0 147.0 147.0 146.0 146.0 146.0 148.0 146.0 147.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:97.00 stddev:0.84 (0.9%) stddev-sans-first:0.87 17:34:00 INFO - PROCESS | 28311 | Values: 97.0 97.0 96.0 97.0 97.0 97.0 97.0 96.0 95.0 95.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#8] json-parse-financial Cycles:10 Average:60.10 Median:59.50 stddev:2.73 (4.6%) stddev-sans-first:2.86 17:34:00 INFO - PROCESS | 28311 | Values: 59.0 60.0 62.0 59.0 59.0 59.0 59.0 60.0 67.0 57.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#9] json-stringify-tinderbox Cycles:10 Average:68.30 Median:68.00 stddev:1.77 (2.6%) stddev-sans-first:1.87 17:34:00 INFO - PROCESS | 28311 | Values: 68.0 67.0 69.0 68.0 68.0 68.0 67.0 67.0 73.0 68.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#10] stanford-crypto-aes Cycles:10 Average:84.10 Median:84.00 stddev:2.92 (3.5%) stddev-sans-first:3.00 17:34:00 INFO - PROCESS | 28311 | Values: 82.0 84.0 91.0 84.0 84.0 83.0 83.0 81.0 82.0 87.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#11] stanford-crypto-ccm Cycles:10 Average:123.00 Median:125.00 stddev:5.96 (4.8%) stddev-sans-first:6.15 17:34:00 INFO - PROCESS | 28311 | Values: 119.0 124.0 128.0 114.0 128.0 114.0 123.0 122.0 126.0 132.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:139.50 Median:141.00 stddev:5.99 (4.2%) stddev-sans-first:5.70 17:34:00 INFO - PROCESS | 28311 | Values: 132.0 141.0 141.0 138.0 141.0 129.0 142.0 138.0 142.0 151.0 17:34:00 INFO - PROCESS | 28311 | 17:34:00 INFO - PROCESS | 28311 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.40 Median:66.50 stddev:1.51 (2.3%) stddev-sans-first:1.58 17:34:00 INFO - PROCESS | 28311 | Values: 67.0 67.0 65.0 70.0 67.0 66.0 65.0 66.0 65.0 66.0 17:34:00 INFO - PROCESS | 28311 | -------- Summary: end -------- 17:34:00 INFO - PROCESS | 28311 | 17:34:01 INFO - TEST-INFO | 28311: exit 0 17:34:01 INFO - TEST-OK | kraken | took 59479ms 17:34:01 INFO - TEST-START | v8_7 17:34:01 INFO - operating with platform_type : linux_ 17:34:01 INFO - Initialising browser for v8_7 test... 17:34:01 INFO - TEST-INFO | started process 28597 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp_bK34z/profile http://localhost:38782/getInfo.html) 17:34:04 INFO - PROCESS | 28597 | 17:34:04 INFO - PROCESS | 28597 | (process:28673): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 17:34:05 INFO - PROCESS | 28597 | __metrics Screen width/height:1600/1200 17:34:05 INFO - PROCESS | 28597 | colorDepth:24 17:34:05 INFO - PROCESS | 28597 | Browser inner width/height: 1024/697 17:34:05 INFO - PROCESS | 28597 | __metrics 17:34:05 INFO - PROCESS | 28597 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 17:34:06 INFO - TEST-INFO | 28597: exit 0 17:34:06 INFO - Browser initialized. 17:34:06 INFO - Running cycle 1/1 for v8_7 test... 17:34:06 INFO - TEST-INFO | started process 28722 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp_bK34z/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:34:07 INFO - PROCESS | 28722 | 17:34:07 INFO - PROCESS | 28722 | (process:28783): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 17:34:18 INFO - PROCESS | 28722 | RSS: Main: 148811776 17:34:18 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | Cycle 1(1): loaded http://localhost:38782/tests/v8_7/run.html (next: http://localhost:38782/tests/v8_7/run.html) 17:34:40 INFO - PROCESS | 28722 | RSS: Main: 144777216 17:34:40 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | __start_tp_report 17:34:40 INFO - PROCESS | 28722 | _x_x_mozilla_page_load 17:34:40 INFO - PROCESS | 28722 | _x_x_mozilla_page_load_details 17:34:40 INFO - PROCESS | 28722 | |i|pagename|runs| 17:34:40 INFO - PROCESS | 28722 | |0;Richards;166.44474034620507 17:34:40 INFO - PROCESS | 28722 | |1;DeltaBlue;193.98642095053347 17:34:40 INFO - PROCESS | 28722 | |2;Encrypt;286.0411899313501 17:34:40 INFO - PROCESS | 28722 | |3;Decrypt;5218.75 17:34:40 INFO - PROCESS | 28722 | |4;RayTrace;1072.8831725616292 17:34:40 INFO - PROCESS | 28722 | |5;Earley;757.5757575757576 17:34:40 INFO - PROCESS | 28722 | |6;Boyer;12243.90243902439 17:34:40 INFO - PROCESS | 28722 | |7;RegExp;41897.95918367347 17:34:40 INFO - PROCESS | 28722 | |8;Splay;577.054794520548 17:34:40 INFO - PROCESS | 28722 | |9;NavierStokes;4826.923076923077 17:34:40 INFO - PROCESS | 28722 | __end_tp_report 17:34:40 INFO - PROCESS | 28722 | __startTimestamp1453426480769__endTimestamp 17:34:40 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | ------- Summary: start ------- 17:34:40 INFO - PROCESS | 28722 | Number of tests: 10 17:34:40 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | [#0] Richards Cycles:1 Average:166.44 Median:166.44 stddev:0.00 (0.0%) 17:34:40 INFO - PROCESS | 28722 | Values: 166.4 17:34:40 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | [#1] DeltaBlue Cycles:1 Average:193.99 Median:193.99 stddev:0.00 (0.0%) 17:34:40 INFO - PROCESS | 28722 | Values: 194.0 17:34:40 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | [#2] Encrypt Cycles:1 Average:286.04 Median:286.04 stddev:0.00 (0.0%) 17:34:40 INFO - PROCESS | 28722 | Values: 286.0 17:34:40 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | [#3] Decrypt Cycles:1 Average:5218.75 Median:5218.75 stddev:0.00 (0.0%) 17:34:40 INFO - PROCESS | 28722 | Values: 5218.8 17:34:40 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | [#4] RayTrace Cycles:1 Average:1072.88 Median:1072.88 stddev:0.00 (0.0%) 17:34:40 INFO - PROCESS | 28722 | Values: 1072.9 17:34:40 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | [#5] Earley Cycles:1 Average:757.58 Median:757.58 stddev:0.00 (0.0%) 17:34:40 INFO - PROCESS | 28722 | Values: 757.6 17:34:40 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | [#6] Boyer Cycles:1 Average:12243.90 Median:12243.90 stddev:0.00 (0.0%) 17:34:40 INFO - PROCESS | 28722 | Values: 12243.9 17:34:40 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | [#7] RegExp Cycles:1 Average:41897.96 Median:41897.96 stddev:0.00 (0.0%) 17:34:40 INFO - PROCESS | 28722 | Values: 41898.0 17:34:40 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | [#8] Splay Cycles:1 Average:577.05 Median:577.05 stddev:0.00 (0.0%) 17:34:40 INFO - PROCESS | 28722 | Values: 577.1 17:34:40 INFO - PROCESS | 28722 | 17:34:40 INFO - PROCESS | 28722 | [#9] NavierStokes Cycles:1 Average:4826.92 Median:4826.92 stddev:0.00 (0.0%) 17:34:40 INFO - PROCESS | 28722 | Values: 4826.9 17:34:40 INFO - PROCESS | 28722 | -------- Summary: end -------- 17:34:40 INFO - PROCESS | 28722 | 17:34:41 INFO - TEST-INFO | 28722: exit 0 17:34:41 INFO - TEST-OK | v8_7 | took 40318ms 17:34:41 INFO - SUITE-END | took 1210s 17:34:41 INFO - Completed test suite (00:20:10) 17:34:41 INFO - Working with test: dromaeo_css 17:34:41 INFO - Generating results file: dromaeo_css 17:34:41 INFO - Working with test: kraken 17:34:41 INFO - Generating results file: kraken 17:34:41 INFO - javascript benchmark 17:34:41 INFO - Working with test: v8_7 17:34:41 INFO - Generating results file: v8_7 17:34:41 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 17:34:41 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,64,43]] 17:34:41 INFO - process_Request line: dromaeo_css 6819.81 graph.html#tests=[[72,64,43]] 17:34:41 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 17:34:41 INFO - process_Request line: kraken 1508.30 graph.html#tests=[[232,64,43]] 17:34:41 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 17:34:41 INFO - process_Request line: v8_7 20198.02 graph.html#tests=[[230,64,43]] 17:34:41 INFO - RETURN: dromaeo_css: 6819.81 17:34:41 INFO - RETURN: kraken: 1508.30 17:34:41 INFO - RETURN: v8_7: 20198.02 17:34:41 INFO - javascript benchmark 17:34:41 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3096.1640357103583, 3123.3909387669387, 3136.38840426117, 3154.5110507871273, 3157.6368717597484, 5203.19350500672, 5215.791368345262, 5218.373795144583, 5234.18870075138, 5243.370795504536, 5108.5146911043485, 5234.953009398126, 5259.237410575464, 5260.395054568726, 5310.73446327684, 4575.313702944552, 4833.806647734086, 4972.378452693413, 4974.651774375795, 5008.799648014094, 4757.310190022445, 4867.2942423348595, 4931.087748766472, 4956.107900577895, 4962.975185124087, 4771.5467030632035, 4780.259059845712, 4807.591354734852, 4836.081144582518, 4837.927431088537, 4703.7883295251795, 4707.741074240916, 4722.055588882237, 4754.572088512016, 4761.761911904391, 4673.976630116827, 4717.551832575899, 4727.361806156159, 4764.190087685102, 4794.688345257582, 5142.125838607446, 5161.7161056141895, 5183.81856635016, 5202.661826981234, 5205.609579281531, 5688.260526131618, 5709.571782116358, 5713.714314284269, 5718.942810571883, 5720.141978703186, 5490.69801160936, 5556.361018482886, 5626.099824028136, 5785.392533783935, 5800.361960184377, 5248.370195576517, 5279.70961597112, 5316.867078323073, 5364.436734142898, 5404.83785486436, 5747.942520574825, 5814.30228372598, 5826.329972053268, 5863.736131874076, 5872.618279811884, 5556.888862222814, 5566.415526369754, 5592.077307244259, 5600.0759874620235, 5605.859853503695, 5423.457654234624, 5549.972250138804, 5588.86027849307, 5674.574406919498, 5707.172459993278, 5607.607467477237, 5607.915881261784, 5611.971940140274, 5613.831585052455, 5618.606697531133, 5439.836804895859, 5576.163575463632, 5577.05190117681, 5611.6071874969175, 5623.465770751854, 4332.0, 4333.241682705514, 4394.758288294174, 4395.0, 4442.155990361821, 3912.8630497933004, 3917.373220284741, 3921.9607803922167, 3950.822213000422, 3964.7621142731527, 5281.735913204325, 5296.523312901857, 5315.096433606296, 5337.066013447631, 5369.0, 5616.803411880564, 5646.20953066571, 5659.179418984307, 5682.0, 5717.62835415705, 5360.463953604608, 5393.703346315911, 5409.29679141709, 5409.7295135243085, 5412.972935135299, 4757.500462451462, 4804.495527969513, 4811.0, 4871.610271178297, 4909.4845041270155, 5821.88356232873, 5823.097419899922, 5832.562557808182, 5847.181394604759, 5862.882742345215, 5565.55475561946, 5573.191887176417, 5576.581756368208, 5582.190582365453, 5598.384177740527, 5771.047777116896, 5771.076627739541, 5774.364819869895, 5787.045137552257, 5787.450192231731, 5549.528290095387, 5555.666660000413, 5591.27313449249, 5594.636348637326, 5652.88694226105, 5671.971640141773, 5691.77232910679, 5717.885642287048, 5737.885242295214, 5740.770369185186, 5428.6199966002005, 5576.581756368208, 5585.804496842591, 5604.355499117653, 5615.129654903497, 5429.6199266051, 5453.700046497481, 5594.440555944373, 5612.0, 5659.490645841894, 5466.3713672928125, 5469.2616496772425, 5484.533814625802, 5486.6982315973, 5511.22842802, 5555.0, 5590.720463976866, 5593.552515798645, 5614.0, 5647.407022262603, 5350.090484617702, 5430.02259593277, 5431.8098866539485, 5444.972775136099, 5480.260164877691], "unit": "score", "name": "dojo.html", "value": 5214.305584158133}, {"lowerIsBetter": false, "replicates": [520.180715373287, 538.0557122250451, 552.4530714592555, 558.5559480213232, 570.9543236541077, 34561.30877382454, 35054.0, 35093.64906350936, 35114.0, 35117.2976540469, 41302.17395652085, 41933.11300991455, 42039.36940945888, 42072.57927420725, 42200.78899605505, 8684.218420342153, 8815.118488151165, 8841.734747957571, 8873.822523549525, 8886.46681199127, 8479.06730259674, 8635.69775057873, 8652.22130008299, 8664.523451210212, 8681.739547813544, 8653.134686531359, 8682.6092825823, 8692.608832602516, 8725.083866194054, 8730.738077857643, 8643.0, 8682.13178682133, 8691.348148888796, 8710.259627931602, 8718.346124040723, 8578.270846978014, 8668.219860212548, 8675.869861952076, 8677.56612169389, 8721.12788721129, 38443.0, 38626.42060369097, 38995.0, 39057.0, 39093.0, 3059.6940305969447, 3273.5908011498564, 3351.3632409842294, 3444.0012396405014, 3730.5896351401325, 29447.558286625717, 29690.0, 30248.24379390511, 30364.69635303663, 31212.687873121205, 3771.113788259784, 3785.8296376662843, 3852.567133719912, 3881.825317860703, 3893.007283142809, 193428.0, 194397.0, 195062.0, 195657.0, 196504.0, 48787.26819097716, 49908.50091499111, 55004.174937375974, 55176.72411637916, 55278.72360638171, 59968.0, 60230.0, 60259.69870150621, 60292.397076029556, 60362.0, 13118.278494682692, 13162.670933226746, 13225.933870330779, 13293.800592991112, 13327.400266988008, 9403.623855045858, 9462.337636365388, 9523.90476095244, 9524.238060955246, 9532.571034303473, 18192.090395480172, 18431.17059732315, 18468.907655461637, 18480.521558275304, 19258.71111933294, 7184.856302873914, 7287.417006639456, 7389.778306650809, 7529.096508418916, 7562.827761696945, 881.9073997230327, 972.9659461918941, 984.773502094508, 1033.5504055735778, 1106.7952428800697, 28264.71735282662, 28687.0, 28908.855455722587, 28912.855435722686, 29958.55062174069, 1039.0856046678873, 1055.2560444886337, 1059.9364038157735, 1074.5272080284649, 1116.2409561498098, 14260.151548473568, 14268.857311426753, 14314.0, 14398.280085995868, 14499.710005799825, 329098.0, 332379.0, 332681.0, 333365.0, 333601.31189504784, 50164.749176253885, 51366.22950655743, 51401.48598514042, 51619.0, 51628.22557661638, 1329.926854023038, 1338.7590233758017, 1346.2326473909973, 1360.149906308557, 1364.1883079567642, 26880.59679104776, 28133.43733125367, 28179.43641127125, 28252.0, 29494.852525737235, 42309.36535951902, 42784.14431711411, 43034.78482607567, 43068.35397468978, 43182.0, 206516.0, 207386.0, 207951.0, 208173.0, 208850.0, 27617.0, 28316.85841570779, 29473.936824422086, 30970.535441968837, 30982.690173098883, 37086.25827483381, 37550.24899502049, 37637.623623763415, 38077.809610951765, 38432.615673842905, 31362.0, 31497.685023149475, 31890.681093189698, 32442.837785811866, 32462.513062303613, 32544.0, 32705.509417358284, 32906.341873161924, 33569.16077098092, 33848.49227261642, 32031.199220019687, 32326.0, 32419.35161296808, 34709.0, 35482.29035419329, 28217.858910705316, 30726.539101913044, 31909.36181276315, 32213.838930805196, 32344.35311293808, 24214.87892560526, 24220.87889560541, 24506.142285019938, 24946.251612451655, 25031.0], "unit": "score", "name": "ext.html", "value": 17442.192333217547}, {"lowerIsBetter": false, "replicates": [365.1546669460199, 365.6818567845974, 366.1651434728816, 366.6278727092001, 370.54423059636645, 15220.391184352626, 16620.25208865601, 16675.833241667595, 17295.39466118686, 17789.822101778995, 15086.245687715598, 15262.236888155576, 15518.146501942389, 15583.532494025198, 16249.675006499892, 4964.702117872921, 5096.413912400066, 5130.769115389798, 5136.203888397305, 5140.306058682087, 4397.978010109961, 4972.154733695281, 5055.342805435288, 5071.594272458213, 5506.256655351516, 5057.519535644126, 5239.449857764918, 5268.025415298163, 5387.676739395649, 5443.782248710067, 5199.350081239845, 5224.921626175629, 5306.0, 5518.806841760519, 5954.077118046666, 5343.919841202385, 5345.839624811262, 5366.785328586851, 5375.22059301403, 5377.435369286247, 14521.927390363086, 19570.608587828305, 20039.699404508945, 20080.29718959844, 20191.697124543145, 1919.8848069115897, 1936.7675878894622, 2010.6280338137344, 2030.7055476955907, 2198.4393979535275, 9439.150476457151, 9723.805523889483, 9769.316147869651, 10535.73660658482, 13025.0, 1779.030428416516, 1798.8021317655048, 1800.9459716208535, 1828.570285982793, 1862.5622978600154, 49196.0, 49938.0, 49980.75009624965, 54464.18303725447, 56194.43805561933, 9657.951710241545, 9919.256055795844, 10074.899251007542, 10075.143612792848, 10094.747631309276, 12859.099863009687, 13111.0, 13113.934430327978, 13138.605841824761, 13160.078794484485, 6550.312217217219, 6617.305182955721, 6649.268580456146, 6666.799996000128, 6708.19501659804, 5928.614640048383, 6095.603785753912, 6114.991026480581, 6125.9693701531205, 6165.784197553064, 3988.441618173458, 4040.010197501631, 4405.911881762347, 4467.508574056851, 4476.6418686505, 1728.0, 1778.7331900214813, 1789.74943507909, 1810.3482746211353, 1825.703750337249, 898.1063841477771, 902.5532361480978, 950.7242899559051, 1006.2151521812998, 1006.6778630838207, 15502.9224853875, 15781.28984195714, 15820.604484887739, 16231.51305460838, 16290.837091628931, 873.0701802580231, 916.0930678628243, 933.5145724223365, 939.0984654731534, 949.6248981652209, 6103.450689437883, 8740.694075707319, 9055.003949565542, 9383.718488445358, 9482.573284202228, 520000.0, 524046.0, 528381.0, 545588.0, 549453.0, 69790.3020969794, 73182.0, 73691.63154184195, 73692.63153684197, 74910.0, 1094.0645747885444, 1106.4744246483017, 1116.9162312826409, 1117.944102794857, 1118.1502058435647, 15003.849961500246, 15052.54842354731, 15148.469803556822, 15348.155851427831, 15723.764143538085, 32908.50637240396, 33072.0, 33240.33519329648, 33976.66023339735, 34441.0, 41301.79349103235, 41770.37344439775, 44477.55522444864, 45093.774531127136, 47157.76421117873, 6804.829879253059, 7005.719771209095, 7030.859382812418, 7033.613151276524, 7091.1490621125795, 3484.1463841359027, 6520.217573891164, 7186.496945213785, 8919.866202006846, 10878.945605271923, 8986.32602554798, 9084.40951338161, 9172.816543668956, 9254.583543740413, 9481.431114133175, 3136.7176954074243, 4123.969007748063, 8887.15572020657, 8893.155150260714, 9295.907040929504, 9124.863127053231, 9283.814323713354, 9357.485338306185, 9377.156055954723, 9498.38260513092, 7206.747763828241, 7218.097737782778, 7330.96334518324, 7384.335409813142, 7403.5928023959195, 8217.95891020541, 9353.766155846159, 9699.70900872975, 9756.317057806169, 9866.309358344846], "unit": "score", "name": "jquery.html", "value": 7813.597951397515}, {"lowerIsBetter": false, "replicates": [1431.7494438473268, 1481.052126638951, 1617.6117731744384, 1748.1783561725983, 1775.4496106207068, 7727.884081738772, 7891.9210807891905, 7978.082520510143, 7983.4810737302105, 8031.0, 7773.572453515055, 7778.611069446519, 7852.411069169807, 7886.369090472763, 7893.210678932118, 2374.9406264843387, 2382.8451150675237, 2384.6899903012586, 2397.508510755291, 2398.20859116492, 2364.8935797889135, 2385.3678775124604, 2385.6660067590465, 2394.6288325309606, 2411.131992482705, 2300.861948283108, 2365.3731761083327, 2371.893264803088, 2372.810175185981, 2388.319328991238, 2369.644553316999, 2411.0476361837063, 2426.6723992261172, 2438.426969662137, 2438.8658623775686, 2405.518896220763, 2409.8674572898485, 2419.4677171022345, 2419.903203871843, 2425.890834912433, 7760.495567788075, 7887.881681774778, 7889.763307100796, 7948.443608947376, 7949.64226609804, 4797.328374027639, 4983.177775667011, 4992.650514463989, 4999.850004499871, 5011.423686276088, 3037.817730936151, 3079.245584831708, 3120.5007198848075, 3126.421612001764, 3137.7332926701256, 1075.8601381820392, 1082.426314053545, 1099.2085698297212, 1103.5254840418618, 1117.3742704085737, 10942.288751231225, 10984.615538456115, 11032.338059716443, 11047.502862371213, 11059.778804423948, 4278.165757677285, 4354.760488173118, 4450.532694067141, 4531.617856553717, 4540.8637740867825, 8922.420042697333, 8958.462492250486, 8965.237954773787, 8974.057723939022, 8984.8652270216, 4901.607871370282, 4916.631252656065, 4922.630802689812, 4933.01339732055, 4963.5036496350795, 4458.929856834401, 4497.977510112494, 4528.184926713223, 4535.229011068126, 4543.045960348298, 3517.067976986101, 3569.39320315547, 3591.44332628443, 3598.8020658864016, 3611.5666120065234, 1081.3619964221148, 1090.220492347975, 1097.35804554335, 1105.2926127278547, 1150.9654710358702, 1310.737852429518, 1311.5540716156552, 1314.737052589486, 1321.682796128922, 1347.9326033698276, 7265.745698900513, 7279.272072792678, 7375.631218439056, 7382.298681625237, 7383.2616738326815, 1086.8641419822522, 1110.1618278199908, 1115.8605174353206, 1120.0479592346603, 1153.0832987774738, 5821.79623713168, 5873.911891321633, 5884.293884733859, 5887.793927212612, 5914.940850591439, 9171.77070573241, 9361.0, 9454.716358509255, 9456.621735130519, 9576.425414475154, 9300.581473833558, 9303.813923721624, 9304.302177336727, 9329.16037556623, 9348.20540254086, 7307.269273072757, 7464.813379665443, 7473.588952607659, 7480.513766605153, 7514.473986820979, 7415.036045314075, 7428.071491063617, 7523.811904702427, 7528.171901090766, 7574.3183113520045, 8426.0, 8553.31573474133, 8587.0, 8591.398602097794, 8642.611082501176, 8574.442661227, 8718.869216961877, 8772.473651580925, 8798.0, 8837.718530813125, 7091.184513780775, 7184.568925864465, 7198.640067996684, 7217.963910180625, 7224.566526008456, 7506.474546781891, 7603.923960760321, 7607.125180604301, 7632.656530456032, 7647.88528172089, 6384.968075159594, 7303.707851685873, 7323.2676732326345, 7373.963130184315, 7537.849243015218, 7022.964885175541, 7105.0, 7114.430845532242, 7198.5680859148615, 7236.34872861445, 6921.826954326182, 7058.188308344606, 7091.9290807091265, 7096.574205547684, 7103.680334385069, 6097.939020609737, 6144.56988010835, 6163.691815409301, 6187.319394866651, 6195.81412557624, 6484.740610375532, 6589.7364105435245, 6597.0764093026055, 6618.404343609098, 6628.933710662832], "unit": "score", "name": "mootools.html", "value": 4604.617953006528}, {"lowerIsBetter": false, "replicates": [343.22088858291664, 349.56304619225966, 350.6826322178428, 351.1467134862285, 358.5661349766783, 6139.72371243294, 6172.105044768506, 6215.968920155398, 6249.718762655686, 6356.110144579751, 6199.566030377864, 6210.65841378724, 6231.376862313767, 6233.750649974007, 6241.906371404421, 4706.576408123268, 4717.9056418871605, 4718.97640511797, 4720.881977950561, 4748.335233067373, 4743.525647435264, 4750.073735621555, 4762.928556071662, 4769.499202583731, 4775.379200703921, 4580.0610874770755, 4606.239970404896, 4619.053094115715, 4661.067786442708, 4665.76671166442, 4650.116477869228, 4654.232051711463, 4699.177643912336, 4700.31845382421, 4708.764561771898, 4096.856610018635, 4106.178764247133, 4106.979465102685, 4115.42384066231, 4116.464859568267, 5881.9705901470215, 5915.733791979371, 5925.229720136398, 5930.080837470199, 5938.881222375571, 5426.810061647863, 5480.945190548084, 5481.095619222823, 5516.779328826842, 5523.226748255248, 6592.538522303441, 6592.901106483407, 6594.109795177686, 6594.472442204612, 6621.933780662228, 4525.208088584484, 4545.250033744428, 4559.202139625552, 4574.931376029363, 4575.931361029554, 6805.2173999989645, 6871.759488417932, 6938.23679395261, 6945.305469453065, 6952.339527744856, 4683.531646835358, 4695.7886895089805, 4701.435827700698, 4703.741294228782, 4707.95292047082, 4737.749568954719, 4746.311784791255, 4756.7859446325, 4760.071786001697, 4777.784999675023, 5508.256385387921, 5518.91721624176, 5521.779128834882, 5522.779088836482, 5528.226048353234, 6582.210134783857, 6618.801435956929, 6665.466762658975, 6680.365365290289, 6687.398134167948, 1673.355758033166, 1696.1180186303054, 1696.3384280130758, 1697.3974239145173, 1697.4822679082997, 1104.5913012185542, 1110.4780753046055, 1115.4645770030431, 1122.1359553144196, 1127.5940661361903, 6317.368263173646, 6318.526110541728, 6326.588771729823, 6336.017917222838, 6341.175647165931, 6844.28135045823, 6849.04113424121, 6851.760188393382, 6855.07456493377, 6862.279460656559, 6192.442680158807, 6273.059041143773, 6305.432511074026, 6308.0537919311555, 6324.810255692337, 3679.79761113136, 3696.094456858087, 3698.7595806272507, 3708.369577171887, 3722.7766334020043, 7181.605011724301, 7194.676239569232, 7205.423566114699, 7266.1280646322775, 7275.67259473325, 6895.482838787111, 7003.999999999898, 7017.157941047107, 7023.403010744144, 7061.752838650623, 7199.460040496983, 7213.639318034077, 7221.4583906207245, 7238.27617238272, 7272.527285726411, 6896.137982752156, 6912.205096413775, 6920.7231710731, 6923.446124310144, 6924.58452492852, 6692.364225398579, 6834.350736680008, 6839.384455399038, 6842.623655698984, 6848.417884479875, 7198.244184360776, 7240.348368646847, 7247.601381924045, 7253.528520646141, 7264.67308971087, 4812.735299558418, 4859.125357435695, 4863.659543831898, 4872.8294509693405, 4873.95126048735, 6768.9661551691925, 6884.001819736211, 6927.099477067949, 6972.233054363915, 6976.6860491277, 6772.661366931535, 6773.593584384953, 6775.525713200029, 6779.593224406552, 6780.118584583973, 6608.70260838273, 6680.298568650416, 6706.0, 6713.462922966249, 6726.226483954212, 6646.335366463315, 6707.0, 6711.865762684816, 6722.394984451423, 6734.764283250062, 6716.932830671631, 6726.764563240263, 6788.59268443895, 6792.150981127359, 6812.182538095461, 6487.18910136233, 6583.769568065095, 6631.469482441296, 6640.0, 6641.933580664325], "unit": "score", "name": "prototype.html", "value": 5015.46127451111}, {"lowerIsBetter": false, "replicates": [701.7263267325742, 754.4643303254688, 816.9632366543505, 839.1314988986398, 858.5363903492115, 12998.155119917199, 13186.802197967027, 15428.69142617147, 15740.055596664208, 15770.921145394286, 12517.561885334015, 12661.746765064716, 12686.238825670467, 12747.0, 12748.617541473748, 790.0716657926941, 795.7214974758846, 798.7723498802842, 802.2659266770897, 802.3581135091932, 794.5351969098056, 797.1948332184478, 803.2048272210499, 805.556943680976, 811.926926576608, 820.9876851847197, 823.0987069159261, 829.2329595124486, 831.7754206364278, 831.9792005199888, 818.1409520003972, 823.2138307915926, 826.2274773087123, 827.0736774812219, 828.5981299069946, 612.4916319454842, 612.8958077126899, 613.2732711736562, 613.7759717703051, 613.9785107521216, 14029.228392438412, 14072.0, 14128.152310861382, 14171.929140354336, 14179.361928713233, 12709.618711438672, 12729.681757956032, 12884.484620615163, 12895.613131606067, 12977.221366718028, 10276.091990737004, 10428.843567346496, 10701.46492675371, 10879.93777764479, 10995.285306455055, 3513.104158439607, 3561.8397172127056, 3577.8926632201074, 3668.4680721295263, 3670.834812433447, 47651.52348476506, 47980.280295795594, 48013.51986480125, 48166.51833481655, 48267.51732482701, 8330.208630180123, 8511.787205319917, 8843.867341989875, 9165.541722913827, 9268.073192680678, 16789.832101679072, 16816.24326905292, 16838.158092095346, 16843.57891052709, 16852.915735421244, 7182.7126914923865, 7286.0, 7412.221716719775, 7463.0, 7630.313271805564, 4030.375291829771, 4122.175564887035, 4199.811008504625, 4203.390508376268, 4399.0, 3036.6356037275227, 3077.9076627701206, 3081.245094951751, 3096.2259435141214, 3099.8915037974016, 542.8588566972616, 549.609777058293, 554.4787899374575, 558.4025093150372, 566.4081035318103, 569.9173619825185, 642.8489305013318, 643.5141468191486, 673.3333999340715, 725.760499035317, 8715.128487151234, 8782.648694052294, 8848.601812918305, 8926.464412135292, 8949.284057275403, 563.2199403825649, 654.5287393076977, 661.3915198017739, 689.0835189198355, 707.0532022875169, 3742.4947632069866, 4006.8797936061965, 4180.0, 4247.235497610398, 4247.681423893158, 56110.15834762482, 56158.43841561614, 56587.0, 57711.71144144252, 58681.70659146762, 51575.74212128916, 52039.21941170885, 52092.21861672078, 52122.47877521176, 52543.211851822256, 22184.556308874056, 22249.555008900054, 36630.0, 47277.0, 47858.76070619694, 8252.33981281484, 8282.782895229488, 8432.241098301183, 8474.237318641352, 8485.872711909204, 33378.66621333756, 33398.33203335871, 33546.496802547495, 34038.48942265918, 34179.14552136217, 41260.1747965045, 41323.793381032905, 42795.86449626065, 43339.56660433355, 43365.34951975786, 9735.951320243354, 9833.360831545926, 9988.35075720105, 10113.49432528356, 10234.846477302995, 10947.178961578073, 10986.945065274622, 11010.284331518425, 11105.777884442105, 11126.165537584875, 10353.896461035294, 10434.895651043393, 10446.791064178826, 10514.316569422963, 10737.838932415863, 10698.304610200312, 11018.724531886766, 11146.442677866236, 11351.262167959056, 11481.82777258325, 10428.322159059637, 10619.256652034283, 10621.628243011457, 10721.35671859691, 10968.561257549927, 8662.480251184948, 9036.638534458549, 9272.72181834546, 9295.535223238676, 9332.25341972627, 8413.158684131538, 8600.440971336842, 8631.13688631157, 9156.118564991948, 9252.306077044113], "unit": "score", "name": "yui.html", "value": 6129.8066006142935}], "name": "dromaeo_css", "value": 6819.8090748831455}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 105.0, 111.0, 111.0, 112.0, 122.0, 110.0, 109.0, 109.0, 111.0], "unit": "score", "name": "ai-astar", "value": 111.1}, {"lowerIsBetter": true, "replicates": [150.0, 134.0, 149.0, 165.0, 126.0, 152.0, 160.0, 137.0, 171.0, 130.0], "unit": "score", "name": "audio-beat-detection", "value": 147.4}, {"lowerIsBetter": true, "replicates": [164.0, 163.0, 162.0, 163.0, 161.0, 163.0, 165.0, 168.0, 166.0, 163.0], "unit": "score", "name": "audio-dft", "value": 163.8}, {"lowerIsBetter": true, "replicates": [73.0, 77.0, 76.0, 76.0, 72.0, 74.0, 155.0, 73.0, 76.0, 74.0], "unit": "score", "name": "audio-fft", "value": 82.6}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 143.0, 96.0, 95.0, 96.0, 145.0, 95.0, 96.0, 134.0], "unit": "score", "name": "audio-oscillator", "value": 109.2}, {"lowerIsBetter": true, "replicates": [109.0, 109.0, 109.0, 110.0, 110.0, 110.0, 109.0, 110.0, 110.0, 110.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.6}, {"lowerIsBetter": true, "replicates": [146.0, 149.0, 147.0, 147.0, 146.0, 146.0, 146.0, 148.0, 146.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 146.8}, {"lowerIsBetter": true, "replicates": [97.0, 97.0, 96.0, 97.0, 97.0, 97.0, 97.0, 96.0, 95.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 96.4}, {"lowerIsBetter": true, "replicates": [59.0, 60.0, 62.0, 59.0, 59.0, 59.0, 59.0, 60.0, 67.0, 57.0], "unit": "score", "name": "json-parse-financial", "value": 60.1}, {"lowerIsBetter": true, "replicates": [68.0, 67.0, 69.0, 68.0, 68.0, 68.0, 67.0, 67.0, 73.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.3}, {"lowerIsBetter": true, "replicates": [82.0, 84.0, 91.0, 84.0, 84.0, 83.0, 83.0, 81.0, 82.0, 87.0], "unit": "score", "name": "stanford-crypto-aes", "value": 84.1}, {"lowerIsBetter": true, "replicates": [119.0, 124.0, 128.0, 114.0, 128.0, 114.0, 123.0, 122.0, 126.0, 132.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 123.0}, {"lowerIsBetter": true, "replicates": [132.0, 141.0, 141.0, 138.0, 141.0, 129.0, 142.0, 138.0, 142.0, 151.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 139.5}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 65.0, 70.0, 67.0, 66.0, 65.0, 66.0, 65.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.4}], "name": "kraken", "value": 1508.3}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [166.44474034620507], "unit": "score", "name": "Richards", "value": 212.09441600000005}, {"lowerIsBetter": false, "replicates": [193.98642095053347], "unit": "score", "name": "DeltaBlue", "value": 340.8382899999999}, {"lowerIsBetter": false, "replicates": [286.0411899313501], "unit": "score", "name": "Encrypt", "value": 930.5687759999998}, {"lowerIsBetter": false, "replicates": [5218.75], "unit": "score", "name": "Decrypt", "value": 51.00474251497002}, {"lowerIsBetter": false, "replicates": [1072.8831725616292], "unit": "score", "name": "RayTrace", "value": 689.7200169830171}, {"lowerIsBetter": false, "replicates": [757.5757575757576], "unit": "score", "name": "Earley", "value": 879.73116}, {"lowerIsBetter": false, "replicates": [12243.90243902439], "unit": "score", "name": "Boyer", "value": 54.4322370517928}, {"lowerIsBetter": false, "replicates": [41897.95918367347], "unit": "score", "name": "RegExp", "value": 21.742944471505123}, {"lowerIsBetter": false, "replicates": [577.054794520548], "unit": "score", "name": "Splay", "value": 141.21882492581605}, {"lowerIsBetter": false, "replicates": [4826.923076923077], "unit": "score", "name": "NavierStokes", "value": 307.4422310756973}], "name": "v8_7", "value": 20198.01678503031}]} 17:34:41 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,43]]", "result": "20198.02"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,43]]", "result": "1508.30"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,43]]", "result": "6819.81"}}} 17:34:41 INFO - Return code: 0 17:34:42 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 17:34:42 INFO - # TBPL SUCCESS # 17:34:42 INFO - Running post-action listener: _resource_record_post_action 17:34:42 INFO - Running post-run listener: _resource_record_post_run 17:34:43 INFO - Total resource usage - Wall time: 1228s; CPU: 13.0%; Read bytes: 4096; Write bytes: 550232064; Read time: 224; Write time: 526420 17:34:43 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 235806720; Read time: 0; Write time: 310112 17:34:43 INFO - run-tests - Wall time: 1212s; CPU: 13.0%; Read bytes: 4096; Write bytes: 313827328; Read time: 224; Write time: 216308 17:34:43 INFO - Running post-run listener: _upload_blobber_files 17:34:43 INFO - Blob upload gear active. 17:34:43 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 17:34:43 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 17:34:43 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 17:34:43 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Fx-Team -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 17:34:43 INFO - (blobuploader) - INFO - Open directory for files ... 17:34:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 17:34:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:34:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:34:44 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 17:34:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:34:44 INFO - (blobuploader) - INFO - Done attempting. 17:34:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 17:34:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:34:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:34:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 17:34:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:34:45 INFO - (blobuploader) - INFO - Done attempting. 17:34:45 INFO - (blobuploader) - INFO - Iteration through files over. 17:34:45 INFO - Return code: 0 17:34:45 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 17:34:45 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 17:34:45 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0cca2400107804bed14e147c740e310612debc4afce124d005b5cfa82c73db6c4b6b5fa7c539f5f0f63d82960707fc7d30400a78118c11b7369ece335a6cc8f0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/efb3dfa301cc016e0d190cbc38442c5791c763bf3411872d966dc75a784a57f08af7b9480652c58610df45cfd40d33402adc7c53031c14b62f5921510d5d6324"} 17:34:45 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 17:34:45 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 17:34:45 INFO - Contents: 17:34:45 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0cca2400107804bed14e147c740e310612debc4afce124d005b5cfa82c73db6c4b6b5fa7c539f5f0f63d82960707fc7d30400a78118c11b7369ece335a6cc8f0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/efb3dfa301cc016e0d190cbc38442c5791c763bf3411872d966dc75a784a57f08af7b9480652c58610df45cfd40d33402adc7c53031c14b62f5921510d5d6324"} 17:34:45 INFO - Running post-run listener: copy_logs_to_upload_dir 17:34:45 INFO - Copying logs to upload dir... 17:34:45 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 17:34:45 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1265.889478 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 5 secs) (at 2016-01-21 17:34:44.986388) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-21 17:34:44.990100) ========= 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=1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0cca2400107804bed14e147c740e310612debc4afce124d005b5cfa82c73db6c4b6b5fa7c539f5f0f63d82960707fc7d30400a78118c11b7369ece335a6cc8f0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/efb3dfa301cc016e0d190cbc38442c5791c763bf3411872d966dc75a784a57f08af7b9480652c58610df45cfd40d33402adc7c53031c14b62f5921510d5d6324"} build_url:https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011206 build_url: 'https://queue.taskcluster.net/v1/task/TeY9uQwaQNeHPvqGLrW0VQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0cca2400107804bed14e147c740e310612debc4afce124d005b5cfa82c73db6c4b6b5fa7c539f5f0f63d82960707fc7d30400a78118c11b7369ece335a6cc8f0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/efb3dfa301cc016e0d190cbc38442c5791c763bf3411872d966dc75a784a57f08af7b9480652c58610df45cfd40d33402adc7c53031c14b62f5921510d5d6324"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-21 17:34:45.014006) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-21 17:34:45.014291) ========= 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=1b9da9da7504fe468691862d000001b9-1453425141.822381-1878487295 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004488 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-21 17:34:45.096235) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-21 17:34:45.096537) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-21 17:34:45.096821) ========= ========= Total master_lag: 0.27 =========