builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-016 starttime: 1447270592.24 results: success (0) buildid: 20151111101339 builduid: 8501585e2d7b423ca60a4f12916a96aa revision: 8bf46ba0297d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.243878) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.244298) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.244579) ========= 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=d6a7e047ef025f707024e163000001c3-1447268838.358401-188899012 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006502 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.276840) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.277127) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.324385) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.324661) ========= 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=d6a7e047ef025f707024e163000001c3-1447268838.358401-188899012 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.027487 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.386049) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.386309) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.386791) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.387073) ========= 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=d6a7e047ef025f707024e163000001c3-1447268838.358401-188899012 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-11 11:36:32-- 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% 216M=0s 2015-11-11 11:36:32 (216 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.180597 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.587748) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.588037) ========= 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=d6a7e047ef025f707024e163000001c3-1447268838.358401-188899012 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.048751 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.654260) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:32.654595) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 8bf46ba0297d --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 8bf46ba0297d --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=d6a7e047ef025f707024e163000001c3-1447268838.358401-188899012 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-11 11:36:32,786 Setting DEBUG logging. 2015-11-11 11:36:32,786 attempt 1/10 2015-11-11 11:36:32,787 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/8bf46ba0297d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-11 11:36:33,267 unpacking tar archive at: fx-team-8bf46ba0297d/testing/mozharness/ program finished with exit code 0 elapsedTime=0.790512 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:33.457532) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:33.457842) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:33.468740) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:33.469054) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-11 11:36:33.469485) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2015-11-11 11:36:33.469768) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --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', '--system-bits', '64', '--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=d6a7e047ef025f707024e163000001c3-1447268838.358401-188899012 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:36:33 INFO - MultiFileLogger online at 20151111 11:36:33 in /builds/slave/test-pgo 11:36:33 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 11:36:33 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 11:36:33 INFO - {'append_to_log': False, 11:36:33 INFO - 'base_work_dir': '/builds/slave/test-pgo', 11:36:33 INFO - 'blob_upload_branch': 'Fx-Team', 11:36:33 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 11:36:33 INFO - 'branch': 'Fx-Team', 11:36:33 INFO - 'buildbot_json_path': 'buildprops.json', 11:36:33 INFO - 'config_files': ('talos/linux_config.py',), 11:36:33 INFO - 'default_actions': ('clobber', 11:36:33 INFO - 'read-buildbot-config', 11:36:33 INFO - 'download-and-extract', 11:36:33 INFO - 'populate-webroot', 11:36:33 INFO - 'create-virtualenv', 11:36:33 INFO - 'install', 11:36:33 INFO - 'run-tests'), 11:36:33 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:36:33 INFO - 'download_minidump_stackwalk': True, 11:36:33 INFO - 'download_symbols': 'ondemand', 11:36:33 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:36:33 INFO - 'tooltool.py': '/tools/tooltool.py', 11:36:33 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:36:33 INFO - '/tools/misc-python/virtualenv.py')}, 11:36:33 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:36:33 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:36:33 INFO - 'installer_path': 'installer.exe', 11:36:33 INFO - 'log_level': 'info', 11:36:33 INFO - 'log_name': 'talos', 11:36:33 INFO - 'log_to_console': True, 11:36:33 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:36:33 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:36:33 INFO - 'opt_config_files': (), 11:36:33 INFO - 'pip_index': False, 11:36:33 INFO - 'sps_profile': False, 11:36:33 INFO - 'sps_profile_interval': 0, 11:36:33 INFO - 'suite': 'dromaeojs-e10s', 11:36:33 INFO - 'system_bits': '64', 11:36:33 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:36:33 INFO - 'title': 'talos-linux64-ix-016', 11:36:33 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:36:33 INFO - 'use_talos_json': True, 11:36:33 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 11:36:33 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:36:33 INFO - 'work_dir': 'build'} 11:36:33 INFO - ##### 11:36:33 INFO - ##### Running clobber step. 11:36:33 INFO - ##### 11:36:33 INFO - Running pre-action listener: _resource_record_pre_action 11:36:33 INFO - Running main action method: clobber 11:36:33 INFO - rmtree: /builds/slave/test-pgo/build 11:36:33 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 11:36:34 INFO - Running post-action listener: _resource_record_post_action 11:36:34 INFO - ##### 11:36:34 INFO - ##### Running read-buildbot-config step. 11:36:34 INFO - ##### 11:36:34 INFO - Running pre-action listener: _resource_record_pre_action 11:36:34 INFO - Running main action method: read_buildbot_config 11:36:34 INFO - Using buildbot properties: 11:36:34 INFO - { 11:36:34 INFO - "properties": { 11:36:34 INFO - "buildnumber": 322, 11:36:34 INFO - "product": "firefox", 11:36:34 INFO - "script_repo_revision": "production", 11:36:34 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 11:36:34 INFO - "repository": "", 11:36:34 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 11:36:34 INFO - "buildid": "20151111101339", 11:36:34 INFO - "slavename": "talos-linux64-ix-016", 11:36:34 INFO - "pgo_build": "True", 11:36:34 INFO - "basedir": "/builds/slave/test-pgo", 11:36:34 INFO - "project": "", 11:36:34 INFO - "platform": "ubuntu64_hw", 11:36:34 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 11:36:34 INFO - "slavebuilddir": "test", 11:36:34 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 11:36:34 INFO - "branch": "fx-team", 11:36:34 INFO - "repo_path": "integration/fx-team", 11:36:34 INFO - "stage_platform": "linux64-pgo", 11:36:34 INFO - "builduid": "8501585e2d7b423ca60a4f12916a96aa", 11:36:34 INFO - "revision": "8bf46ba0297d" 11:36:34 INFO - }, 11:36:34 INFO - "sourcestamp": { 11:36:34 INFO - "repository": "", 11:36:34 INFO - "hasPatch": false, 11:36:34 INFO - "project": "", 11:36:34 INFO - "branch": "fx-team-linux64-pgo-talos", 11:36:34 INFO - "changes": [ 11:36:34 INFO - { 11:36:34 INFO - "category": null, 11:36:34 INFO - "files": [ 11:36:34 INFO - { 11:36:34 INFO - "url": null, 11:36:34 INFO - "name": "https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 11:36:34 INFO - } 11:36:34 INFO - ], 11:36:34 INFO - "repository": "", 11:36:34 INFO - "rev": "8bf46ba0297d", 11:36:34 INFO - "who": "sendchange", 11:36:34 INFO - "when": 1447270553, 11:36:34 INFO - "number": 6649921, 11:36:34 INFO - "comments": "", 11:36:34 INFO - "project": "", 11:36:34 INFO - "at": "Wed 11 Nov 2015 11:35:53", 11:36:34 INFO - "branch": "fx-team-linux64-pgo-talos", 11:36:34 INFO - "revlink": "", 11:36:34 INFO - "properties": [ 11:36:34 INFO - [ 11:36:34 INFO - "buildid", 11:36:34 INFO - "20151111101339", 11:36:34 INFO - "Change" 11:36:34 INFO - ], 11:36:34 INFO - [ 11:36:34 INFO - "builduid", 11:36:34 INFO - "8501585e2d7b423ca60a4f12916a96aa", 11:36:34 INFO - "Change" 11:36:34 INFO - ], 11:36:34 INFO - [ 11:36:34 INFO - "pgo_build", 11:36:34 INFO - "True", 11:36:34 INFO - "Change" 11:36:34 INFO - ] 11:36:34 INFO - ], 11:36:34 INFO - "revision": "8bf46ba0297d" 11:36:34 INFO - } 11:36:34 INFO - ], 11:36:34 INFO - "revision": "8bf46ba0297d" 11:36:34 INFO - } 11:36:34 INFO - } 11:36:34 INFO - Found installer url https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 11:36:34 INFO - Running post-action listener: _resource_record_post_action 11:36:34 INFO - ##### 11:36:34 INFO - ##### Running download-and-extract step. 11:36:34 INFO - ##### 11:36:34 INFO - Running pre-action listener: _resource_record_pre_action 11:36:34 INFO - Running main action method: download_and_extract 11:36:34 INFO - mkdir: /builds/slave/test-pgo/build/tests 11:36:34 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')]} 11:36:34 INFO - https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 11:36:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/test_packages.json 11:36:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/test_packages.json 11:36:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 11:36:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 11:36:36 INFO - Downloaded 1302 bytes. 11:36:36 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 11:36:36 INFO - Using the following test package requirements: 11:36:36 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 11:36:36 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:36 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:36:36 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:36 INFO - u'jsshell-linux-x86_64.zip'], 11:36:36 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:36 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:36:36 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 11:36:36 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:36 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:36:36 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:36 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:36:36 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:36 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:36:36 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 11:36:36 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:36 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:36:36 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:36:36 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')]} 11:36:36 INFO - https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:36:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 11:36:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 11:36:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 11:36:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:36:38 INFO - Downloaded 22438242 bytes. 11:36:38 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 11:36:38 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 11:36:38 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 11:36:39 INFO - Return code: 0 11:36:39 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 11:36:39 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')]} 11:36:39 INFO - https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:36:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 11:36:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 11:36:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 11:36:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:36:41 INFO - Downloaded 22438242 bytes. 11:36:41 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 11:36:41 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 11:36:41 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 11:36:43 INFO - Return code: 0 11:36:43 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')]} 11:36:43 INFO - https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:36:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 11:36:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 11:36:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 11:36:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 11:36:44 INFO - Downloaded 11131693 bytes. 11:36:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test-pgo/build/tests 11:36:44 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 11:36:44 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 11:36:44 INFO - Return code: 0 11:36: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')]} 11:36:44 INFO - https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:36:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 11:36:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 11:36:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 11:36:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 11:36:46 INFO - Downloaded 57155703 bytes. 11:36:46 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 11:36:46 INFO - mkdir: /builds/slave/test-pgo/properties 11:36:46 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 11:36:46 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 11:36:46 INFO - Contents: 11:36:46 INFO - build_url:https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 11:36:46 INFO - Running post-action listener: _resource_record_post_action 11:36:46 INFO - Running post-action listener: set_extra_try_arguments 11:36:46 INFO - ##### 11:36:46 INFO - ##### Running populate-webroot step. 11:36:46 INFO - ##### 11:36:46 INFO - Running pre-action listener: _resource_record_pre_action 11:36:46 INFO - Running main action method: populate_webroot 11:36:46 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:36:46 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:36:46 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 11:36:46 INFO - '../fennec_ids.txt'], 11:36:46 INFO - 'tests': ['tcheck2']}, 11:36:46 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:36:46 INFO - '--tppagecycles', 11:36:46 INFO - '7'], 11:36:46 INFO - 'tests': ['tsvgm']}}, 11:36:46 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 11:36:46 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 11:36:46 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:36:46 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 11:36:46 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 11:36:46 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 11:36:46 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:36:46 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:46 INFO - 'talos_options': ['--e10s'], 11:36:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:36:46 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:46 INFO - 'tests': ['damp', 'tps']}, 11:36:46 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:46 INFO - 'talos_options': ['--e10s'], 11:36:46 INFO - 'tests': ['damp', 'tps']}, 11:36:46 INFO - 'g3': {'tests': ['dromaeo_dom']}, 11:36:46 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:36:46 INFO - 'other': {'tests': ['a11yr', 11:36:46 INFO - 'ts_paint', 11:36:46 INFO - 'tpaint', 11:36:46 INFO - 'sessionrestore', 11:36:46 INFO - 'sessionrestore_no_auto_restore']}, 11:36:46 INFO - 'other-e10s': {'talos_options': ['--e10s'], 11:36:46 INFO - 'tests': ['a11yr', 11:36:46 INFO - 'ts_paint', 11:36:46 INFO - 'tpaint', 11:36:46 INFO - 'sessionrestore', 11:36:46 INFO - 'sessionrestore_no_auto_restore']}, 11:36:46 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 11:36:46 INFO - 'tests': ['a11yr', 11:36:46 INFO - 'ts_paint', 11:36:46 INFO - 'tpaint', 11:36:46 INFO - 'sessionrestore', 11:36:46 INFO - 'sessionrestore_no_auto_restore']}, 11:36:46 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 11:36:46 INFO - 'tests': ['a11yr', 11:36:46 INFO - 'ts_paint', 11:36:46 INFO - 'tpaint', 11:36:46 INFO - 'sessionrestore', 11:36:46 INFO - 'sessionrestore_no_auto_restore']}, 11:36:46 INFO - 'other_l64': {'tests': ['a11yr', 11:36:46 INFO - 'ts_paint', 11:36:46 INFO - 'tpaint', 11:36:46 INFO - 'sessionrestore', 11:36:46 INFO - 'sessionrestore_no_auto_restore']}, 11:36:46 INFO - 'other_nol64': {'tests': ['a11yr', 11:36:46 INFO - 'ts_paint', 11:36:46 INFO - 'tpaint', 11:36:46 INFO - 'sessionrestore', 11:36:46 INFO - 'sessionrestore_no_auto_restore']}, 11:36:46 INFO - 'svgr': {'tests': ['tsvgx', 11:36:46 INFO - 'tsvgr_opacity', 11:36:46 INFO - 'tart', 11:36:46 INFO - 'tscrollx', 11:36:46 INFO - 'cart']}, 11:36:46 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 11:36:46 INFO - 'tests': ['tsvgx', 11:36:46 INFO - 'tsvgr_opacity', 11:36:46 INFO - 'tart', 11:36:46 INFO - 'tscrollx', 11:36:46 INFO - 'cart']}, 11:36:46 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:46 INFO - 'tests': ['tp5o']}, 11:36:46 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:46 INFO - 'talos_options': ['--e10s'], 11:36:46 INFO - 'tests': ['tp5o']}, 11:36:46 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:46 INFO - 'talos_options': ['--xperf_path', 11:36:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:36:46 INFO - 'tests': ['tp5n']}, 11:36:46 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:46 INFO - 'talos_options': ['--e10s', 11:36:46 INFO - '--xperf_path', 11:36:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:36:46 INFO - 'tests': ['tp5n']}}, 11:36:46 INFO - 'talos.zip': {'path': '', 11:36:46 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:36:46 INFO - Running post-action listener: _resource_record_post_action 11:36:46 INFO - ##### 11:36:46 INFO - ##### Running create-virtualenv step. 11:36:46 INFO - ##### 11:36:46 INFO - Running pre-action listener: _resource_record_pre_action 11:36:46 INFO - Running main action method: create_virtualenv 11:36:46 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 11:36:46 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 11:36:46 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 11:36:46 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:36:46 INFO - Using real prefix '/usr' 11:36:46 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 11:36:47 INFO - Installing distribute.............................................................................................................................................................................................done. 11:36:49 INFO - Installing pip.................done. 11:36:49 INFO - Return code: 0 11:36:49 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 11:36:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:36:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:36:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:36:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:36:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:49 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f378bf7ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c8c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d4d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dd68c0>, '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 0x1d83420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d838b0>, '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': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', '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 11:36:49 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 11:36:49 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 11:36:49 INFO - Using env: {'DISPLAY': ':0', 11:36:49 INFO - 'HOME': '/home/cltbld', 11:36:49 INFO - 'LANG': 'en_US.UTF-8', 11:36:49 INFO - 'LANGUAGE': 'en_US:en', 11:36:49 INFO - 'LOGNAME': 'cltbld', 11:36:49 INFO - 'MAIL': '/var/mail/cltbld', 11:36:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:36:49 INFO - 'MOZ_NO_REMOTE': '1', 11:36:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:36:49 INFO - 'NO_EM_RESTART': '1', 11:36:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:36:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:36:49 INFO - 'PWD': '/builds/slave/test-pgo', 11:36:49 INFO - 'SHELL': '/bin/bash', 11:36:49 INFO - 'SHLVL': '1', 11:36:49 INFO - 'TERM': 'linux', 11:36:49 INFO - 'TMOUT': '86400', 11:36:49 INFO - 'USER': 'cltbld', 11:36:49 INFO - 'XDG_SESSION_COOKIE': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', 11:36:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:36:49 INFO - '_': '/tools/buildbot/bin/python'} 11:36:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:36:49 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 11:36:49 INFO - Cleaning up... 11:36:49 INFO - Return code: 0 11:36:49 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 11:36:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:36:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:36:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:36:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:36:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:49 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f378bf7ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c8c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d4d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dd68c0>, '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 0x1d83420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d838b0>, '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': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', '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 11:36:49 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 11:36:49 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 11:36:49 INFO - Using env: {'DISPLAY': ':0', 11:36:49 INFO - 'HOME': '/home/cltbld', 11:36:49 INFO - 'LANG': 'en_US.UTF-8', 11:36:49 INFO - 'LANGUAGE': 'en_US:en', 11:36:49 INFO - 'LOGNAME': 'cltbld', 11:36:49 INFO - 'MAIL': '/var/mail/cltbld', 11:36:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:36:49 INFO - 'MOZ_NO_REMOTE': '1', 11:36:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:36:49 INFO - 'NO_EM_RESTART': '1', 11:36:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:36:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:36:49 INFO - 'PWD': '/builds/slave/test-pgo', 11:36:49 INFO - 'SHELL': '/bin/bash', 11:36:49 INFO - 'SHLVL': '1', 11:36:49 INFO - 'TERM': 'linux', 11:36:49 INFO - 'TMOUT': '86400', 11:36:49 INFO - 'USER': 'cltbld', 11:36:49 INFO - 'XDG_SESSION_COOKIE': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', 11:36:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:36:49 INFO - '_': '/tools/buildbot/bin/python'} 11:36:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:36:49 INFO - Downloading/unpacking psutil>=0.7.1 11:36:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:36:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:36:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:36:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:36:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:36:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:36:51 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 11:36:51 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 11:36:51 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 11:36:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:36:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:36:51 INFO - Installing collected packages: psutil 11:36:51 INFO - Running setup.py install for psutil 11:36:51 INFO - building 'psutil._psutil_linux' extension 11:36:51 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 11:36:51 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 11:36:51 INFO - building 'psutil._psutil_posix' extension 11:36:51 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 11:36:51 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 11:36:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:36:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:36:51 INFO - Successfully installed psutil 11:36:51 INFO - Cleaning up... 11:36:51 INFO - Return code: 0 11:36:51 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 11:36:51 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')]} 11:36:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:36:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:51 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')]} 11:36:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:36:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:51 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f378bf7ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c8c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d4d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dd68c0>, '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 0x1d83420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d838b0>, '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': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', '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 11:36:51 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 11:36:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 11:36:51 INFO - Using env: {'DISPLAY': ':0', 11:36:51 INFO - 'HOME': '/home/cltbld', 11:36:51 INFO - 'LANG': 'en_US.UTF-8', 11:36:51 INFO - 'LANGUAGE': 'en_US:en', 11:36:51 INFO - 'LOGNAME': 'cltbld', 11:36:51 INFO - 'MAIL': '/var/mail/cltbld', 11:36:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:36:51 INFO - 'MOZ_NO_REMOTE': '1', 11:36:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:36:51 INFO - 'NO_EM_RESTART': '1', 11:36:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:36:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:36:51 INFO - 'PWD': '/builds/slave/test-pgo', 11:36:51 INFO - 'SHELL': '/bin/bash', 11:36:51 INFO - 'SHLVL': '1', 11:36:51 INFO - 'TERM': 'linux', 11:36:51 INFO - 'TMOUT': '86400', 11:36:51 INFO - 'USER': 'cltbld', 11:36:51 INFO - 'XDG_SESSION_COOKIE': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', 11:36:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:36:51 INFO - '_': '/tools/buildbot/bin/python'} 11:36:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:36:52 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 11:36:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:36:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:36:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:36:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:36:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:36:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:36:53 INFO - Downloading mozsystemmonitor-0.0.tar.gz 11:36:53 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 11:36:53 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:36:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 11:36:53 INFO - Installing collected packages: mozsystemmonitor 11:36:53 INFO - Running setup.py install for mozsystemmonitor 11:36:53 INFO - Successfully installed mozsystemmonitor 11:36:53 INFO - Cleaning up... 11:36:53 INFO - Return code: 0 11:36:53 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 11:36: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')]} 11:36:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:36:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36: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')]} 11:36:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:36:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:53 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f378bf7ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c8c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d4d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dd68c0>, '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 0x1d83420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d838b0>, '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': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', '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 11:36:53 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 11:36:53 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 11:36:53 INFO - Using env: {'DISPLAY': ':0', 11:36:53 INFO - 'HOME': '/home/cltbld', 11:36:53 INFO - 'LANG': 'en_US.UTF-8', 11:36:53 INFO - 'LANGUAGE': 'en_US:en', 11:36:53 INFO - 'LOGNAME': 'cltbld', 11:36:53 INFO - 'MAIL': '/var/mail/cltbld', 11:36:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:36:53 INFO - 'MOZ_NO_REMOTE': '1', 11:36:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:36:53 INFO - 'NO_EM_RESTART': '1', 11:36:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:36:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:36:53 INFO - 'PWD': '/builds/slave/test-pgo', 11:36:53 INFO - 'SHELL': '/bin/bash', 11:36:53 INFO - 'SHLVL': '1', 11:36:53 INFO - 'TERM': 'linux', 11:36:53 INFO - 'TMOUT': '86400', 11:36:53 INFO - 'USER': 'cltbld', 11:36:53 INFO - 'XDG_SESSION_COOKIE': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', 11:36:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:36:53 INFO - '_': '/tools/buildbot/bin/python'} 11:36:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:36:54 INFO - Downloading/unpacking blobuploader==1.2.4 11:36:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:36:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:36:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:36:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:36:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:36:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:36:55 INFO - Downloading blobuploader-1.2.4.tar.gz 11:36:55 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 11:36:55 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:36:55 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:36:55 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 11:36:55 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 11:36:55 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 11:36:55 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 11:36:55 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 11:36:55 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 11:36:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 11:36:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 11:36:56 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:36: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 11:36: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 11:36: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 11:36: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 11:36: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 11:36: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 11:36:56 INFO - Downloading docopt-0.6.1.tar.gz 11:36:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 11:36:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 11:36:56 INFO - Installing collected packages: blobuploader, requests, docopt 11:36:56 INFO - Running setup.py install for blobuploader 11:36:56 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:36:56 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 11:36:56 INFO - Running setup.py install for requests 11:36:56 INFO - Running setup.py install for docopt 11:36:57 INFO - Successfully installed blobuploader requests docopt 11:36:57 INFO - Cleaning up... 11:36:57 INFO - Return code: 0 11:36:57 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:36:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:36:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:36:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:36:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:36:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:57 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f378bf7ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c8c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d4d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dd68c0>, '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 0x1d83420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d838b0>, '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': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', '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 11:36:57 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 11:36:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:36:57 INFO - Using env: {'DISPLAY': ':0', 11:36:57 INFO - 'HOME': '/home/cltbld', 11:36:57 INFO - 'LANG': 'en_US.UTF-8', 11:36:57 INFO - 'LANGUAGE': 'en_US:en', 11:36:57 INFO - 'LOGNAME': 'cltbld', 11:36:57 INFO - 'MAIL': '/var/mail/cltbld', 11:36:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:36:57 INFO - 'MOZ_NO_REMOTE': '1', 11:36:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:36:57 INFO - 'NO_EM_RESTART': '1', 11:36:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:36:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:36:57 INFO - 'PWD': '/builds/slave/test-pgo', 11:36:57 INFO - 'SHELL': '/bin/bash', 11:36:57 INFO - 'SHLVL': '1', 11:36:57 INFO - 'TERM': 'linux', 11:36:57 INFO - 'TMOUT': '86400', 11:36:57 INFO - 'USER': 'cltbld', 11:36:57 INFO - 'XDG_SESSION_COOKIE': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', 11:36:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:36:57 INFO - '_': '/tools/buildbot/bin/python'} 11:36:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:36:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:36:57 INFO - Running setup.py (path:/tmp/pip-PyC0pI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:36:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:36:57 INFO - Running setup.py (path:/tmp/pip-WwJ12B-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:36:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:36:57 INFO - Running setup.py (path:/tmp/pip-kJ0SdH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:36:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:36:57 INFO - Running setup.py (path:/tmp/pip-rliXnQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:36:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 11:36:57 INFO - Running setup.py (path:/tmp/pip-Of6012-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 11:36:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:36:57 INFO - Running setup.py (path:/tmp/pip-kKMoWE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:36:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:36:57 INFO - Running setup.py (path:/tmp/pip-eOH4RJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:36:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:36:57 INFO - Running setup.py (path:/tmp/pip-ecifBJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:36:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 11:36:57 INFO - Running setup.py (path:/tmp/pip-rR6Sak-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 11:36:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 11:36:57 INFO - Running setup.py (path:/tmp/pip-FYZjml-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 11:36:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:36:58 INFO - Running setup.py (path:/tmp/pip-YBtybk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:36:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:36:58 INFO - Running setup.py (path:/tmp/pip-po6WgO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:36:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:36:58 INFO - Running setup.py (path:/tmp/pip-_ljLQo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:36:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:36:58 INFO - Running setup.py (path:/tmp/pip-XlkYnV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:36:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:36:58 INFO - Running setup.py (path:/tmp/pip-b6sQ3u-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:36:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 11:36:58 INFO - Running setup.py (path:/tmp/pip-Y0dDWJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 11:36:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 11:36:58 INFO - Running setup.py (path:/tmp/pip-0fvtdY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 11:36:58 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:36:58 INFO - Running setup.py install for manifestparser 11:36:58 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 11:36:58 INFO - Running setup.py install for mozcrash 11:36:58 INFO - Running setup.py install for mozdebug 11:36:59 INFO - Running setup.py install for mozdevice 11:36:59 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 11:36:59 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 11:36:59 INFO - Running setup.py install for mozfile 11:36:59 INFO - Running setup.py install for mozhttpd 11:36:59 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 11:36:59 INFO - Running setup.py install for mozinfo 11:36:59 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 11:36:59 INFO - Running setup.py install for mozInstall 11:37:00 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 11:37:00 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 11:37:00 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 11:37:00 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 11:37:00 INFO - Running setup.py install for mozleak 11:37:00 INFO - Running setup.py install for mozlog 11:37:00 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 11:37:00 INFO - Running setup.py install for moznetwork 11:37:00 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 11:37:00 INFO - Running setup.py install for mozprocess 11:37:00 INFO - Running setup.py install for mozprofile 11:37:00 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 11:37:00 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 11:37:00 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 11:37:00 INFO - Running setup.py install for mozrunner 11:37:00 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 11:37:00 INFO - Running setup.py install for mozscreenshot 11:37:00 INFO - Running setup.py install for moztest 11:37:00 INFO - Running setup.py install for mozversion 11:37:00 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 11:37:00 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:37:00 INFO - Cleaning up... 11:37:00 INFO - Return code: 0 11:37:00 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:37:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:37:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:37:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:37:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:37:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37:00 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f378bf7ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c8c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d4d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dd68c0>, '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 0x1d83420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d838b0>, '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': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', '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 11:37:00 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 11:37:00 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:37:00 INFO - Using env: {'DISPLAY': ':0', 11:37:00 INFO - 'HOME': '/home/cltbld', 11:37:00 INFO - 'LANG': 'en_US.UTF-8', 11:37:00 INFO - 'LANGUAGE': 'en_US:en', 11:37:00 INFO - 'LOGNAME': 'cltbld', 11:37:00 INFO - 'MAIL': '/var/mail/cltbld', 11:37:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:37:00 INFO - 'MOZ_NO_REMOTE': '1', 11:37:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:37:00 INFO - 'NO_EM_RESTART': '1', 11:37:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:37:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:37:00 INFO - 'PWD': '/builds/slave/test-pgo', 11:37:00 INFO - 'SHELL': '/bin/bash', 11:37:00 INFO - 'SHLVL': '1', 11:37:00 INFO - 'TERM': 'linux', 11:37:00 INFO - 'TMOUT': '86400', 11:37:00 INFO - 'USER': 'cltbld', 11:37:00 INFO - 'XDG_SESSION_COOKIE': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', 11:37:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:37:00 INFO - '_': '/tools/buildbot/bin/python'} 11:37:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:37:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:37:01 INFO - Running setup.py (path:/tmp/pip-lM0Pm5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 11:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 11:37:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:37:01 INFO - Running setup.py (path:/tmp/pip-tWjLHq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 11:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 11:37:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:37:01 INFO - Running setup.py (path:/tmp/pip-YPLFhe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 11:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 11:37:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:37:01 INFO - Running setup.py (path:/tmp/pip-PNFoNC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 11:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 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)) 11:37:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 11:37:01 INFO - Running setup.py (path:/tmp/pip-ULjg9n-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 11:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5)) 11:37:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:37:01 INFO - Running setup.py (path:/tmp/pip-GMe0_6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 11:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6)) 11:37:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:37:01 INFO - Running setup.py (path:/tmp/pip-Pqxk1V-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 11:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7)) 11:37:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:37:01 INFO - Running setup.py (path:/tmp/pip-PXnf28-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 11:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8)) 11:37:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 11:37:01 INFO - Running setup.py (path:/tmp/pip-Qgwb2K-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 11:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 11:37:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 11:37:01 INFO - Running setup.py (path:/tmp/pip-HaMNoL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 11:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 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)) 11:37:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:37:01 INFO - Running setup.py (path:/tmp/pip-uPGbMN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 11:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 11:37:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:37:01 INFO - Running setup.py (path:/tmp/pip-G0mahe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 11:37:02 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)) 11:37:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:37:02 INFO - Running setup.py (path:/tmp/pip-jnO0vf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 11:37:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 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)) 11:37:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:37:02 INFO - Running setup.py (path:/tmp/pip-3cpabO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 11:37:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 11:37:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:37:02 INFO - Running setup.py (path:/tmp/pip-9pS1Xx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 11:37:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 11:37:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 11:37:02 INFO - Running setup.py (path:/tmp/pip-BQoG0Y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 11:37:02 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16)) 11:37:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 11:37:02 INFO - Running setup.py (path:/tmp/pip-6LkDHx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 11:37:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 11:37:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 11:37:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 11:37:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 11:37:02 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 11:37:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 11:37:02 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 11:37:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:37:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:37:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:37:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:37:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:37:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:37:04 INFO - Downloading blessings-1.5.1.tar.gz 11:37:04 INFO - Storing download in cache at /builds/slave/test-pgo/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 11:37:04 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 11:37:04 INFO - Installing collected packages: blessings 11:37:04 INFO - Running setup.py install for blessings 11:37:04 INFO - Successfully installed blessings 11:37:04 INFO - Cleaning up... 11:37:04 INFO - Return code: 0 11:37:04 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 11:37:04 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 11:37:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 11:37:04 INFO - Reading from file tmpfile_stdout 11:37:04 INFO - Current package versions: 11:37:04 INFO - argparse == 1.2.1 11:37:04 INFO - blessings == 1.5.1 11:37:04 INFO - blobuploader == 1.2.4 11:37:04 INFO - docopt == 0.6.1 11:37:04 INFO - manifestparser == 1.1 11:37:04 INFO - mozInstall == 1.12 11:37:04 INFO - mozcrash == 0.16 11:37:04 INFO - mozdebug == 0.1 11:37:04 INFO - mozdevice == 0.47 11:37:04 INFO - mozfile == 1.2 11:37:04 INFO - mozhttpd == 0.7 11:37:04 INFO - mozinfo == 0.9 11:37:04 INFO - mozleak == 0.1 11:37:04 INFO - mozlog == 3.0 11:37:04 INFO - moznetwork == 0.27 11:37:04 INFO - mozprocess == 0.22 11:37:04 INFO - mozprofile == 0.27 11:37:04 INFO - mozrunner == 6.11 11:37:04 INFO - mozscreenshot == 0.1 11:37:04 INFO - mozsystemmonitor == 0.0 11:37:04 INFO - moztest == 0.7 11:37:04 INFO - mozversion == 1.4 11:37:04 INFO - psutil == 3.1.1 11:37:04 INFO - requests == 1.2.3 11:37:04 INFO - wsgiref == 0.1.2 11:37:04 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 11:37: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')]} 11:37:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:37:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37: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')]} 11:37:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:37:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37:04 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f378bf7ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c8c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d4d3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dd68c0>, '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 0x1d83420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d838b0>, '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': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', '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 11:37:04 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/talos 11:37:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 11:37:04 INFO - Using env: {'DISPLAY': ':0', 11:37:04 INFO - 'HOME': '/home/cltbld', 11:37:04 INFO - 'LANG': 'en_US.UTF-8', 11:37:04 INFO - 'LANGUAGE': 'en_US:en', 11:37:04 INFO - 'LOGNAME': 'cltbld', 11:37:04 INFO - 'MAIL': '/var/mail/cltbld', 11:37:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:37:04 INFO - 'MOZ_NO_REMOTE': '1', 11:37:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:37:04 INFO - 'NO_EM_RESTART': '1', 11:37:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:37:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:37:04 INFO - 'PWD': '/builds/slave/test-pgo', 11:37:04 INFO - 'SHELL': '/bin/bash', 11:37:04 INFO - 'SHLVL': '1', 11:37:04 INFO - 'TERM': 'linux', 11:37:04 INFO - 'TMOUT': '86400', 11:37:04 INFO - 'USER': 'cltbld', 11:37:04 INFO - 'XDG_SESSION_COOKIE': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', 11:37:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:37:04 INFO - '_': '/tools/buildbot/bin/python'} 11:37:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:37:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 11:37:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2)) 11:37:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 11:37:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 11:37:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5)) 11:37:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6)) 11:37:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7)) 11:37:04 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8)) 11:37:04 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.15->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 11:37:04 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 11:37:04 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 11:37:04 INFO - Cleaning up... 11:37:04 INFO - Return code: 0 11:37:04 INFO - Running post-action listener: _resource_record_post_action 11:37:04 INFO - Running post-action listener: _start_resource_monitoring 11:37:04 INFO - Starting resource monitoring. 11:37:04 INFO - ##### 11:37:04 INFO - ##### Running install step. 11:37:04 INFO - ##### 11:37:04 INFO - Running pre-action listener: _resource_record_pre_action 11:37:04 INFO - Running main action method: install 11:37:04 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 11:37:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 11:37:05 INFO - Reading from file tmpfile_stdout 11:37:05 INFO - Detecting whether we're running mozinstall >=1.0... 11:37:05 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 11:37:05 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 11:37:05 INFO - Reading from file tmpfile_stdout 11:37:05 INFO - Output received: 11:37:05 INFO - Usage: mozinstall [options] installer 11:37:05 INFO - Options: 11:37:05 INFO - -h, --help show this help message and exit 11:37:05 INFO - -d DEST, --destination=DEST 11:37:05 INFO - Directory to install application into. [default: 11:37:05 INFO - "/builds/slave/test-pgo"] 11:37:05 INFO - --app=APP Application being installed. [default: firefox] 11:37:05 INFO - mkdir: /builds/slave/test-pgo/build/application 11:37:05 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 11:37:05 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 11:37:19 INFO - Reading from file tmpfile_stdout 11:37:19 INFO - Output received: 11:37:19 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 11:37:19 INFO - Running post-action listener: _resource_record_post_action 11:37:19 INFO - ##### 11:37:19 INFO - ##### Running run-tests step. 11:37:19 INFO - ##### 11:37:19 INFO - Running pre-action listener: _resource_record_pre_action 11:37:19 INFO - Running main action method: run_tests 11:37:19 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 11:37:19 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 11:37:19 INFO - Python 2.7.3 11:37:19 INFO - Return code: 0 11:37:19 INFO - grabbing minidump binary from tooltool 11:37:19 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')]} 11:37:19 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 0x1dd68c0>, '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 0x1d83420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d838b0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 11:37:19 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 11:37:19 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 11:37:19 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:37:19 INFO - Return code: 0 11:37:19 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 11:37:19 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 11:37:19 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 11:37:19 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 11:37:19 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 11:37:19 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-016', '--webServer', 'localhost'] in /builds/slave/test-pgo/build 11:37:19 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-016 --webServer localhost 11:37:19 INFO - Using env: {'DISPLAY': ':0', 11:37:19 INFO - 'HOME': '/home/cltbld', 11:37:19 INFO - 'LANG': 'en_US.UTF-8', 11:37:19 INFO - 'LANGUAGE': 'en_US:en', 11:37:19 INFO - 'LOGNAME': 'cltbld', 11:37:19 INFO - 'MAIL': '/var/mail/cltbld', 11:37:19 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 11:37:19 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 11:37:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:37:19 INFO - 'MOZ_NO_REMOTE': '1', 11:37:19 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 11:37:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:37:19 INFO - 'NO_EM_RESTART': '1', 11:37:19 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:37:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 11:37:19 INFO - 'PWD': '/builds/slave/test-pgo', 11:37:19 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 11:37:19 INFO - 'SHELL': '/bin/bash', 11:37:19 INFO - 'SHLVL': '1', 11:37:19 INFO - 'TERM': 'linux', 11:37:19 INFO - 'TMOUT': '86400', 11:37:19 INFO - 'USER': 'cltbld', 11:37:19 INFO - 'XDG_SESSION_COOKIE': 'd6a7e047ef025f707024e163000001c3-1447268838.358401-188899012', 11:37:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:37:19 INFO - '_': '/tools/buildbot/bin/python'} 11:37:19 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-016', '--webServer', 'localhost'] with output_timeout 3600 11:37:19 INFO - mozversion INFO | application_buildid: 20151111101339 11:37:19 INFO - mozversion INFO | application_changeset: 8bf46ba0297dfecfdbae08edc1166d8a10bbadf8 11:37:19 INFO - mozversion INFO | application_display_name: Nightly 11:37:19 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:37:19 INFO - mozversion INFO | application_name: Firefox 11:37:19 INFO - mozversion INFO | application_remotingname: firefox 11:37:19 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 11:37:19 INFO - mozversion INFO | application_vendor: Mozilla 11:37:19 INFO - mozversion INFO | application_version: 45.0a1 11:37:19 INFO - mozversion INFO | platform_buildid: 20151111101339 11:37:19 INFO - mozversion INFO | platform_changeset: 8bf46ba0297dfecfdbae08edc1166d8a10bbadf8 11:37:19 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 11:37:19 INFO - mozversion INFO | platform_version: 45.0a1 11:37:19 INFO - 2015-11-11 11:37:19,718 DEBUG : using testdate: 1447270639 11:37:19 INFO - 2015-11-11 11:37:19,718 DEBUG : actual date: 1447270639 11:37:19 INFO - 2015-11-11 11:37:19,766 INFO : starting webserver on 'localhost:42812' 11:37:19 INFO - 2015-11-11 11:37:19,766 INFO : Starting test suite talos-linux64-ix-016.e 11:37:19 INFO - 2015-11-11 11:37:19,767 INFO : Starting test dromaeo_css 11:37:19 INFO - 2015-11-11 11:37:19,767 DEBUG : operating with platform_type : linux_ 11:37:19 INFO - 2015-11-11 11:37:19,767 INFO : Initialising browser for dromaeo_css test... 11:37:19 INFO - 2015-11-11 11:37:19,780 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp_gbIQ4/profile http://localhost:42812/getInfo.html 11:37:24 INFO - 2015-11-11 11:37:24,062 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 11:37:24 INFO - 2015-11-11 11:37:24,062 DEBUG : BROWSER_OUTPUT: colorDepth:24 11:37:24 INFO - 2015-11-11 11:37:24,062 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 11:37:24 INFO - 2015-11-11 11:37:24,062 DEBUG : BROWSER_OUTPUT: __metrics 11:37:25 INFO - 2015-11-11 11:37:25,133 INFO : Browser initialized. 11:37:25 INFO - 2015-11-11 11:37:25,134 INFO : Running cycle 1/1 for dromaeo_css test... 11:37:25 INFO - 2015-11-11 11:37:25,134 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp_gbIQ4/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 11:37:36 INFO - 2015-11-11 11:37:36,915 DEBUG : BROWSER_OUTPUT: RSS: Main: 138166272 11:37:36 INFO - 2015-11-11 11:37:36,916 DEBUG : BROWSER_OUTPUT: 11:38:26 INFO - 2015-11-11 11:38:26,553 DEBUG : BROWSER_OUTPUT: 1447270706552 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] 11:40:35 INFO - 2015-11-11 11:40:35,525 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/dromaeo/cssquery-dojo.html (next: http://localhost:42812/tests/dromaeo/cssquery-ext.html) 11:40:36 INFO - 2015-11-11 11:40:36,556 DEBUG : BROWSER_OUTPUT: RSS: Main: 144052224 11:40:36 INFO - 2015-11-11 11:40:36,557 DEBUG : BROWSER_OUTPUT: 11:43:38 INFO - 2015-11-11 11:43:38,512 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/dromaeo/cssquery-ext.html (next: http://localhost:42812/tests/dromaeo/cssquery-jquery.html) 11:43:39 INFO - 2015-11-11 11:43:39,094 DEBUG : BROWSER_OUTPUT: RSS: Main: 141189120 11:43:39 INFO - 2015-11-11 11:43:39,094 DEBUG : BROWSER_OUTPUT: 11:46:40 INFO - 2015-11-11 11:46:40,742 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/dromaeo/cssquery-jquery.html (next: http://localhost:42812/tests/dromaeo/cssquery-mootools.html) 11:46:41 INFO - 2015-11-11 11:46:41,323 DEBUG : BROWSER_OUTPUT: RSS: Main: 142020608 11:46:41 INFO - 2015-11-11 11:46:41,324 DEBUG : BROWSER_OUTPUT: 11:49:42 INFO - 2015-11-11 11:49:42,968 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/dromaeo/cssquery-mootools.html (next: http://localhost:42812/tests/dromaeo/cssquery-prototype.html) 11:49:43 INFO - 2015-11-11 11:49:43,574 DEBUG : BROWSER_OUTPUT: RSS: Main: 140554240 11:49:43 INFO - 2015-11-11 11:49:43,575 DEBUG : BROWSER_OUTPUT: 11:52:45 INFO - 2015-11-11 11:52:45,927 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/dromaeo/cssquery-prototype.html (next: http://localhost:42812/tests/dromaeo/cssquery-yui.html) 11:52:46 INFO - 2015-11-11 11:52:46,549 DEBUG : BROWSER_OUTPUT: RSS: Main: 140439552 11:52:46 INFO - 2015-11-11 11:52:46,549 DEBUG : BROWSER_OUTPUT: 11:55:48 INFO - 2015-11-11 11:55:48,714 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/dromaeo/cssquery-yui.html (next: http://localhost:42812/tests/dromaeo/cssquery-dojo.html) 11:55:48 INFO - 2015-11-11 11:55:48,964 DEBUG : BROWSER_OUTPUT: RSS: Main: 143904768 11:55:48 INFO - 2015-11-11 11:55:48,965 DEBUG : BROWSER_OUTPUT: 11:55:48 INFO - 2015-11-11 11:55:48,965 DEBUG : BROWSER_OUTPUT: __start_tp_report 11:55:48 INFO - 2015-11-11 11:55:48,965 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 11:55:48 INFO - 2015-11-11 11:55:48,965 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 11:55:48 INFO - 2015-11-11 11:55:48,965 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 11:55:48 INFO - 2015-11-11 11:55:48,966 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3192.6009248843893;3261.4292498812715;3274.5088236764495;3290.4735242361226;3297.2581169236923;5426.484483974026;5490.313710786152;5522.254495643087;5526.917096243555;5586.692731899749;5435.537979271767;5489.3961664217;5523.199136125259;5544.972275138619;5563.944360556393;4992.151334273164;5000.224965130411;5169.121249387595;5176.637635365526;5190.740462976855;4890.633202509808;5066.544011039005;5114.718690472023;5153.81961631343;5162.741862906859;4975.179095449264;5029.069622119901;5081.8475445736685;5099.668521546125;5130.769115389817;5053.5957123430035;5083.110455670243;5090.236464530313;5116.6674166179455;5123.3339665843205;4926.827561035382;5017.974910125463;5060.898782024339;5067.5185857343495;5079.288899554065;5227.581793456515;5281.207818827168;5326.627136100475;5339.5461385782255;5411.323584551931;5983.6110652807865;6011.879762404771;6013.067974463965;6014.51883849291;6025.276966763972;5774.624649397776;5932.436418540232;5946.7026648667825;6038.064100064497;6042.12389203563;5641.605087643867;5686.061799802987;5688.857778555569;5692.886142277172;5712.485876271114;6118.663473509;6151.446369826737;6164.321924588381;6167.074938759132;6183.041628547582;5763.308402991668;5834.474897259182;5868.2664666916635;5924.289085309791;5944.554158438134;5987.970060149759;5989.981703110481;6013.067974463965;6031.638101713911;6038.698065096728;5971.343152253248;5980.760769569256;5995;6012.158297838306;6015.909761353583;5875.294964604275;5890.352061273256;5985.431384018511;6001.759929602855;6012.669303188367;4651.976740116278;4660.277656963176;4667.696599721007;4675.064987002613;4704.529547045337;4134.875953721393;4138.02756352257;4149.8340066397;4152.688548358885;4154.459920210354;5459.535939445192;5655.688937108416;5665.801696940587;5774;5789.189513468118;6011.879762404727;6042.637441753509;6070.332263451017;6073.817785466443;6074;5543.057680194376;5744.885102298014;5746.2529871116485;5746.396628354046;5759.827205183851;5129.333186685782;5179.964007198575;5207.791688332424;5209.973950130225;5245.527902488794;6156.168917196211;6247.625142491465;6272.937270627326;6281;6288.811335659938;5863.794767183128;6058.57589968698;6060.181875446935;6065.939340606537;6084.056971169299;6135.6932153393045;6198.2252218472695;6287.96856015717;6309.7160627770945;6325.146105275729;5874.295084589877;5892.9116063258225;5908.527317814479;5913.113033045078;5927.585069045125;5900.586958912835;5992.221011268507;6002;6003.279606447254;6022;5773.624714393551;5852.912206316993;5875.970620146872;5892.852678682896;5909.143174239797;5732.914006289826;5752.050911599539;5770.13447982806;5820.388859169726;5843.707814609337;5643.887122257614;5676.17695434168;5732.570057245806;5736.68448235351;5785.884282314414;5868.2664666916635;5942.64344139353;5954.612950158225;5976.521878249817;5984.790532331347;5816.680082595329;5823.854403639943;5826.271716035496;5837.270341207349;5837.970810146092 11:55:48 INFO - 2015-11-11 11:55:48,968 DEBUG : BROWSER_OUTPUT: |1;ext.html;559.9776008959642;564.9265595472585;570.3583468597827;571.3429556010587;583.7344008476143;31746.841265793668;32423.83788081059;39333.40999885;40157;40403.393949090714;42929.7853510732;43356.78321608395;43559.34660980088;43800;43809.342859857126;8626.18051285127;8786.736397908073;8788.296936245117;8795.648174073029;8812.735617931472;8555.743327700147;8587.012493563227;8664.306855451548;8664.740057798244;8677.045524992245;8659.870101948476;8700.434471759347;8716.607752651114;8759.824803503927;8767.079456657055;8682.218600325969;8707.60815763289;8740.47557146567;8774.824503509957;8775.385722999392;8529.786755331104;8593.699220527315;8614.87077693835;8675.43609665376;8700.434471759316;39767.8011609943;40075.59924400777;40213;40260;40276.79861600673;3253.5770349854606;3418.6581341865863;3526.717862570988;3837.3668344723087;3971.801409929492;30031.549526757117;30147;30338.84830575833;30345.393092138256;31447.685523144704;3470.7049900758466;3533.152043509565;3545.7163426925786;3579.49887015818;3682.208325210093;271611;273762;274285;274512;449973.99999999674;59132.40867591269;59740.70129649324;59822.70088649529;59910.40089599048;59935.10097348543;63887.36112638907;63926.36073639204;64053.47705876128;64310.67844660747;64563;15833.841661583238;15998;16097.436589719304;16098;16144.434944776876;11283;11322.207445478902;11325.15061370384;11386.373749443861;11392.487338069806;19629.705554416694;20348.796512034987;20444.28445004418;20488.59022819565;20593.279235226993;8020.839583208303;8065.7176998805935;8199.303059240032;8208.958955205306;8340.37447191463;931.1573026411108;937.1378331934636;986.9851952220722;1055.614700634263;1063.5107850388754;28107.859460702974;28181;28327.858360708065;28399.858000709864;28655.426891462055;1024.155072065549;1047.450088703437;1053.0627741310086;1141.4349896801136;1145.971350716222;14451.855481445262;14473.638159046108;14622.780658290134;14911.478098266725;14922;312143;315536;316195;316814;317174;50574.747126264134;51174.48825511697;51208;51377.7431112842;51475.227871581956;1339.9330033498286;1348.8381394232754;1349.9392527336292;1352.783554631274;1357.0704067713648;27473.587896181973;27541.724582754716;27779.166625001282;28116.85941570279;28283.43433131285;45713.77143114396;46165.76917115393;46301.76849115733;46531.302030470244;46744.53255467402;293821;294434;295838;296142;297897;32217.838910805294;42584.36123458089;43258;43467.782661086494;43618;43334.133317334105;44278.33582496201;44341.77829110834;44387.55612443834;45344.773276133405;36532;36736.448953265186;37263.25473490569;37930.241395172496;38173.61826381701;37165;37267.25465490621;37596.62403375931;37725.62274377331;37994.620053800216;36655.26689466249;36766.816165919;36835.63164368429;40396.3940540898;41291.58708412998;31840.52239216367;33624.49563256504;33717;33937;35681.46477802887;24815.87592062028;25144.37139071538;25321;25473.49053018966;25494.235172944842 11:55:48 INFO - 2015-11-11 11:55:48,971 DEBUG : BROWSER_OUTPUT: |2;jquery.html;352.57162547504777;355.65856777493605;356.78949419842286;357.7567254267099;360.7889384709945;11861.406929653525;12341.382930853444;16671.249793759296;17273;17925.282988680454;11467.885321146787;11485.425728713573;11498.540058397675;11585.246958947662;11834.28994260345;4497.977510112445;4585.4726706428855;4590.311453282001;4601.976990115061;4603.10239503297;4459.777011149446;4585.335126406669;4588.77056147193;4596.080783843245;4596.724196548218;4546.29532422475;4553.772311384434;4757.333973243749;4882.780274887638;4907.190313598252;4874.073925954058;4875.171220892439;4875.683080599767;4876.634252431064;4878.390201224847;4070.9796451017555;4148.91702165958;4159;4171.833126674929;4174;13517;13520.661983450394;13805.447782088704;13816.792748108786;13875.167489950636;1919.6256729937668;2008.8694234874686;2060.3612880007095;2070.8032736890123;2144.654993521357;9631.662891798753;9687.225021998223;9703.223742100616;9945.353552019167;9997.000299970017;1634.7547867819803;1648.3406637345038;1668.1575804218912;1704.701677206484;1777.2269062957655;60654.69672651653;61304.693476532775;61587.38412615861;62727.37272627261;62996.370036299966;6849.623270720059;6949.2008419031445;6964.268751781091;7005.404540614105;7046.401055910203;8364.163583641708;8407.915920840836;8434.283085937765;8452.704155354533;8460.830783384297;5807.796727114531;5831.3877042910735;5833.82498525045;5855.970720146372;5883.882322353529;6108.267007959073;6126.724297406628;6139.539534534928;6146.508279337642;6181.81454556364;3213.2770126721302;3238.5304130900886;3279.9016029519153;3285.375778602058;3300.966990330066;1144.0904480937675;1148.8908553687386;1161.1233518693332;1161.976760464786;1211.1703483114095;388.88139117568846;397.2214459659043;403.4231049599101;407.66367746609166;425.6467132280262;9391.436513809193;10138.138258247984;10549.261551691308;10559.04968552834;10590.894091059145;417.2781088716537;419.5552714123039;430.4984692832877;432.25220368762217;433.5079684558049;5488.780448782084;5509.47659972302;5556.111022236423;5602.2717046783655;5652.2652055233375;388403;390557;392838;396532;528157;76614.61692691501;77233.61383193047;78412;78692.60653696809;79513.44622260876;439.0976543203683;450.1245078322631;453.07572551993565;453.46491140453924;455.53990469625916;9518.095780900803;9555.474448905377;9686.612535498502;9909.536806494565;10068.345557538736;37265.81367093147;37670;38251.80874095612;38722.61277387303;39013.60986390214;49934.75032624959;50286.7485662584;50877.745611271705;51070.23394649158;51318.230226545886;8050.597470126353;8319.376046796393;8361.16388361159;8414.368922330972;8504.617292221741;11551.71120721955;11841.5855445059;11855;11868.525258989544;11897.107716921093;10320.896791031993;10788.514516846604;10908.34549927007;10952.178586606196;10971.83542246851;10496.422696751752;10777.89222107769;10783.245172837826;10919.727006824893;11090.334579925231;10618.256722029384;10928.890711092787;11053.226274161054;11072.39101849406;11145.777084458428;7971.322437592869;7986.763706162284;8274.462159959825;8388.916110839058;8400.159984001551;10629.681109566725;10837.403942783223;11005;11049.060829829234;11100.777984440427 11:55:48 INFO - 2015-11-11 11:55:48,972 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1504.1802217791303;1693.5681401242684;1731.5151757507895;1755.754194412782;1758.9032603206826;7304.890426643591;7345;7467.477276590641;7491.513051651639;7601.961990190041;7883.684652613889;7914.604269786502;7949.721759738411;7962.323202527792;7977.641006154722;2287.7712228777114;2339.30990357844;2345.6129738593195;2346.389938615955;2355.5759963206615;2310.5378924215142;2336.8247381446376;2338.053088499152;2339.5554844579474;2364.9054037838464;2215.235743668432;2258.559580881729;2261.1294651559106;2288.4622113803243;2312.838101332907;2293.185918998748;2304.9078036878673;2312.306308107561;2314.8032417244553;2324.1284518305633;2253.785890340415;2285.1544928376607;2286.3369622809364;2292.86242825431;2297.4945511987335;7563.130240022413;7619.771406857803;7678.500897441649;7694.384449244047;7704.6147692615705;4647.55848194421;4666;4715.41057367829;4718.7168769873915;4735.455422626374;3227.9031629051165;3247.4641684122093;3258.0877354340823;3272.8690852365876;3305.0415379539904;1034.2863424237328;1042.5673345561584;1064.8455973883742;1074.9032587067202;1153.8384626152344;10678.092362149227;10702.678919632346;10726.14190864721;10750.139988800876;10758.838617420744;4078.5105787305715;4150.771707556113;4209.684273679486;4222.894427639334;4230.915381692349;8691.826163476822;8697.652093916298;8703.564821758886;8724.258438032712;8742.431741936882;4574.336721175411;4588.059447813191;4589.770511474413;4591.311303304531;4607.3089036644105;4196.370544418301;4204.8528301509305;4214;4221.261279276115;4236.809343579546;3501.824908754552;3524.0837382280793;3543.8759643412873;3546.840392182358;3578.5169002184894;1078.5685725709623;1093.4314156638504;1094.5293523784849;1095.370162156763;1099.8735145458375;1016.8627235323137;1073.1736562846565;1076.7308172956762;1130.141092769501;1211.2913945341897;7400.185979542246;7424.888626670604;7429.257074292527;7448.702051917862;7470.140933792683;1131.3947038334616;1141.1315639980473;1152.3086148311113;1157.7105723569107;1172.4782471800138;5843.737031833578;5889.793857214977;5912.320083190488;5918.319393269829;5970.0746384310505;9398.624055037859;9538.236941044699;9603.37578057424;9612.807743845084;9626.422414655142;9003.864942025875;9160.267178625694;9215.078492150866;9296.67461638853;9343.672971446103;7324.4872858900435;7338;7361.300676435837;7375.778726638209;7401.666924988388;7170.2471240519;7343.3390994810725;7347.228541003117;7360.5215660984;7376.299251571092;8157.632906519102;8282.875756863772;8337.66649334044;8449.746507604536;8524.36067294943;8456.40805143634;8486.10895855951;8634.352423568384;8644.394892357475;8645.308375330083;6897.48268879826;6961.547499412522;7038.2961703829205;7063.894041589483;7091.219965803861;7609.277118673717;7681.078270607562;7722.459427839997;7728.149903510497;7733.845323093394;7138.39323657495;7161.4986950912935;7196;7314.268573142643;7319.2314806944505;6702.229243637044;6727.529072964846;6727.865442691216;6732.865342693217;6840.794776156723;7118.644067796693;7129.714811407485;7144.428445724226;7155.642217888981;7161.57030578167;6396.32838551964;6502.642354670538;6510.576812507361;6523.11937888398;6535.509836762167;6401.455876250571;6697.598144111369;6752.291009444134;6764.222114456704;6764.661766911537 11:55:48 INFO - 2015-11-11 11:55:48,974 DEBUG : BROWSER_OUTPUT: |4;prototype.html;318.8899829558802;323.7604172912046;326.68801294763506;329.32652725177;333.3715945442841;6082.391760823921;6096.207493025906;6097.4817140543055;6098.085287206921;6173.969130154354;6001.699915004254;6022.939770602293;6034.24571928509;6037.0642550404755;6048.667323297217;4567.4062371891605;4577.977110114445;4578.404807375045;4583.977080114595;4588.059447813207;4582.404287442644;4588.197065513538;4589.2198326284615;4589.885252868671;4607.124646317189;4476.9776151119195;4533.3426653135275;4554.157480866033;4608.055348653518;4625.953740462586;4584.862454126348;4596.448426188878;4616.8153273869;4631;4632.143053535106;3976.5426975897853;3982.8406863725418;3984.920301593952;3993.820278087493;3995.2808494470983;5737.770489180428;5811.157382179603;5814.912776308359;5839.620424672383;5857.326407463111;5251.4485978972425;5297.205419187114;5345.118055520835;5345.65253258537;5347.144456886918;6412.903806442907;6431.389018043278;6448.355164483561;6458.354164583551;6458.580192287486;4398.956010439919;4399.098184872094;4407.206702793496;4416.624586910117;4417.624501917341;6567.408933196035;6623.801285961429;6679.33206679333;6705.2624211336715;6724.025016372648;4457.9331310030375;4481.775911204427;4485.6860019798305;4487.528809475023;4494.438195225597;4552.613027892667;4552.749598772033;4558.8632341029825;4562.543745625478;4568.428946381702;5307.938412317475;5310.495502927216;5316.016536940679;5335.759890804923;5339;6400.583962042452;6522.347765223534;6527.967360163264;6533.607983521004;6534.411902928759;1586.9603259918363;1612.6613411183548;1624.0255846492246;1631.8087795909053;1634.035918807909;1049.5486940615456;1061.2040969273046;1070.5289672544056;1071.603506702525;1080.6757972608186;6069.605475644069;6074.878502429927;6087.573869829158;6130.386961303834;6144.9246381882995;6471.546991710535;6484.319146489645;6504.707288172043;6530.216374035146;6533.150690410216;6120.479759220427;6163.8150855474405;6168.074788781719;6197.163382943335;6223.408776166257;3671.81640917953;3759.661630453272;3762.795905310329;3763.1156678180605;3763.8306276217636;7039.120109986252;7046.224915259318;7055.717771289091;7065.6113913735235;7082.39799617028;6805.625690587065;6819.863602727918;6882.4149947254045;6920.204176519664;6929.688164032631;6898;7089.042979197846;7090.326418990187;7097.680604372712;7114.893276600855;6687.665616719048;6707.564008339442;6768.458523318024;6772.796816095525;6784.626845523346;6600.273969863215;6671;6675.198976122896;6679.265280819203;6686.732530698718;7010;7054.047703559953;7072.823179420556;7080.645967701491;7087.291270872872;4453.465584129925;4489.775511224491;4503.121891231179;4513.774311284488;4518.9832287735;6654.700538475683;6703.3296670332575;6712;6719.361660642231;6776.966115169393;6511.869762604816;6513.772017979348;6526;6566.9343306568235;6571.112899758471;6463.7737679181;6504.642244676588;6517.4460170886005;6517.706703198272;6522.15212022434;6197.4732147767945;6337.651429171256;6348.238211414475;6353.428191462791;6370.649614271259;6487.416132548094;6494.837629059311;6497.870042599027;6498.707558159799;6531.2489063756375;6276.686165691788;6299.6535190564955;6300.527460440394;6307.022411526221;6319.210098737658 11:55:48 INFO - 2015-11-11 11:55:48,975 DEBUG : BROWSER_OUTPUT: |5;yui.html;844.3878188313472;846.9110743371946;848.1094850407073;852.9402941794077;871.6992637540051;13457.394417251222;13507.25710085946;13679.726405471885;13800.378982945766;13890;12889.742205155891;12969.870301296984;12976.675583110427;13038.413271402786;13328;793.5714714054403;812.2486699802688;813.8494378539959;814.1614137438448;814.6578437056451;813.2964985287713;816.4652152839899;818.1572979830754;822.5640410582371;823.8105235795771;846.720582207873;847.8134810341714;851.5486792000249;854.9529775862325;857.5197889182047;843.7595285343679;851.3146916732028;851.5571902610639;851.7061613743249;853.4921721575653;623.0778447897093;625.1778910732418;625.424609359386;625.5214760708062;626.589583822597;11861.11041671878;11881.524739010429;11896.940515297454;11939.283642981449;12010.459529321202;10867.45662716861;11141.832872506919;11261.54953801847;11361.659150225507;11448.198626096177;9898.554565044518;9954.800903981879;9980.750481238027;10003.199744020461;10009.499525023719;3547.6807087362004;3596.388613935611;3631.6731494165388;3672.2839046385966;3709.7217708671687;46172.845678857964;46484;46493.30260046102;46589.76705116487;47178.76410617925;10139.847902281472;10225.130863876653;10269.127124194378;10387.94806025965;10431.68704938853;18031.819681803016;18089.819101809077;18125.18436670353;18131.093445327682;18145.45563633093;7696.384289256846;7732.458727888994;7915.604219788987;8015.278624923785;8140.75577732669;4227;4265;4323.329883867943;4328.545502722169;4356.172327257874;3129.6870312968977;3136.7490600751885;3142.0573827851554;3159.7156255936616;3179.713825755693;490.4800911034315;492.7019153412134;506.154721614904;507.0163882068775;514.6474664854586;661.5336187987457;665.9533832631766;666.8566258254401;668.8093893240404;732.4250463386217;8152.714654987047;8286.295664868554;8360.28937540316;8461.534615596202;8631.827363452696;614.3426533609085;653.3009679642737;673.1585518102372;674.4267372733235;674.7975607317785;3986.7307320411123;4044.8179831907637;4074.6740260779065;4093.263212621697;4171.186618609403;57323.713381432826;57406.138907916415;57582.7120864393;58180.709096454244;60005.69997149986;52041;52986.47013529892;53082.957119073624;53544.46455535472;53675.19487207695;43677.781611092374;44685;48405.27392089122;48951.531454056436;49550;8704.782380440287;8827.911720882967;8858.689945851864;8885.955570222366;8913.910860891308;36456.817715912315;36858.44712329371;36871.63128368682;37190.44214336733;37429;45944.77027614974;46410.30384544302;46686.299705505124;47500.524994750995;47849.76075119602;8416.074231834371;8516.531590762568;8566.229039386486;8579.184977427134;8641.913580864111;12786.360681965678;12799.872001279868;12950.93524532409;12995.350232488148;13004.739905201654;11250.549978000789;11250.66248012561;11253.88746112561;11345.489452974802;12131.21147125434;11668.358240296526;11906.345151016778;12004.21972571815;12361.07291953089;12404.937975310066;11411.486483108114;11552.768944620891;11580.30518168879;11867.109966752356;11939.880601193878;10063.446510441703;10147.289778892073;10182.541785619516;10261.333013354108;10627.89372106269;8994.640214391351;9487.573059212215;9785.461799600806;9804.509774511389;9863.556139973574 11:55:48 INFO - 2015-11-11 11:55:48,975 DEBUG : BROWSER_OUTPUT: __end_tp_report 11:55:48 INFO - 2015-11-11 11:55:48,975 DEBUG : BROWSER_OUTPUT: __start_cc_report 11:55:48 INFO - 2015-11-11 11:55:48,975 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,289 11:55:48 INFO - 2015-11-11 11:55:48,975 DEBUG : BROWSER_OUTPUT: __end_cc_report 11:55:48 INFO - 2015-11-11 11:55:48,975 DEBUG : BROWSER_OUTPUT: __startTimestamp1447271748963__endTimestamp 11:55:48 INFO - 2015-11-11 11:55:48,975 DEBUG : BROWSER_OUTPUT: 11:55:48 INFO - 2015-11-11 11:55:48,975 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 11:55:48 INFO - 2015-11-11 11:55:48,975 DEBUG : BROWSER_OUTPUT: Number of tests: 6 11:55:48 INFO - 2015-11-11 11:55:48,976 DEBUG : BROWSER_OUTPUT: 11:55:48 INFO - 2015-11-11 11:55:48,976 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5563.34 Median:5774.00 stddev:630.61 (10.9%) stddev-sans-first:604.50 11:55:48 INFO - 2015-11-11 11:55:48,976 DEBUG : BROWSER_OUTPUT: Values: 3192.6 3261.4 3274.5 3290.5 3297.3 5426.5 5490.3 5522.3 5526.9 5586.7 5435.5 5489.4 5523.2 5545.0 5563.9 4992.2 5000.2 5169.1 5176.6 5190.7 4890.6 5066.5 5114.7 5153.8 5162.7 4975.2 5029.1 5081.8 5099.7 5130.8 5053.6 5083.1 5090.2 5116.7 5123.3 4926.8 5018.0 5060.9 5067.5 5079.3 5227.6 5281.2 5326.6 5339.5 5411.3 5983.6 6011.9 6013.1 6014.5 6025.3 5774.6 5932.4 5946.7 6038.1 6042.1 5641.6 5686.1 5688.9 5692.9 5712.5 6118.7 6151.4 6164.3 6167.1 6183.0 5763.3 5834.5 5868.3 5924.3 5944.6 5988.0 5990.0 6013.1 6031.6 6038.7 5971.3 5980.8 5995.0 6012.2 6015.9 5875.3 5890.4 5985.4 6001.8 6012.7 4652.0 4660.3 4667.7 4675.1 4704.5 4134.9 4138.0 4149.8 4152.7 4154.5 5459.5 5655.7 5665.8 5774.0 5789.2 6011.9 6042.6 6070.3 6073.8 6074.0 5543.1 5744.9 5746.3 5746.4 5759.8 5129.3 5180.0 5207.8 5210.0 5245.5 6156.2 6247.6 6272.9 6281.0 6288.8 5863.8 6058.6 6060.2 6065.9 6084.1 6135.7 6198.2 6288.0 6309.7 6325.1 5874.3 5892.9 5908.5 5913.1 5927.6 5900.6 5992.2 6002.0 6003.3 6022.0 5773.6 5852.9 5876.0 5892.9 5909.1 5732.9 5752.1 5770.1 5820.4 5843.7 5643.9 5676.2 5732.6 5736.7 5785.9 5868.3 5942.6 5954.6 5976.5 5984.8 5816.7 5823.9 5826.3 5837.3 5838.0 11:55:48 INFO - 2015-11-11 11:55:48,976 DEBUG : BROWSER_OUTPUT: 11:55:48 INFO - 2015-11-11 11:55:48,976 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:48088.64 Median:37661.12 stddev:81042.20 (215.2%) stddev-sans-first:81190.97 11:55:48 INFO - 2015-11-11 11:55:48,976 DEBUG : BROWSER_OUTPUT: Values: 560.0 564.9 570.4 571.3 583.7 31746.8 32423.8 39333.4 40157.0 40403.4 42929.8 43356.8 43559.3 43800.0 43809.3 8626.2 8786.7 8788.3 8795.6 8812.7 8555.7 8587.0 8664.3 8664.7 8677.0 8659.9 8700.4 8716.6 8759.8 8767.1 8682.2 8707.6 8740.5 8774.8 8775.4 8529.8 8593.7 8614.9 8675.4 8700.4 39767.8 40075.6 40213.0 40260.0 40276.8 3253.6 3418.7 3526.7 3837.4 3971.8 30031.5 30147.0 30338.8 30345.4 31447.7 3470.7 3533.2 3545.7 3579.5 3682.2 271611.0 273762.0 274285.0 274512.0 449974.0 59132.4 59740.7 59822.7 59910.4 59935.1 63887.4 63926.4 64053.5 64310.7 64563.0 15833.8 15998.0 16097.4 16098.0 16144.4 11283.0 11322.2 11325.2 11386.4 11392.5 19629.7 20348.8 20444.3 20488.6 20593.3 8020.8 8065.7 8199.3 8209.0 8340.4 931.2 937.1 987.0 1055.6 1063.5 28107.9 28181.0 28327.9 28399.9 28655.4 1024.2 1047.5 1053.1 1141.4 1146.0 14451.9 14473.6 14622.8 14911.5 14922.0 312143.0 315536.0 316195.0 316814.0 317174.0 50574.7 51174.5 51208.0 51377.7 51475.2 1339.9 1348.8 1349.9 1352.8 1357.1 27473.6 27541.7 27779.2 28116.9 28283.4 45713.8 46165.8 46301.8 46531.3 46744.5 293821.0 294434.0 295838.0 296142.0 297897.0 32217.8 42584.4 43258.0 43467.8 43618.0 43334.1 44278.3 44341.8 44387.6 45344.8 36532.0 36736.4 37263.3 37930.2 38173.6 37165.0 37267.3 37596.6 37725.6 37994.6 36655.3 36766.8 36835.6 40396.4 41291.6 31840.5 33624.5 33717.0 33937.0 35681.5 24815.9 25144.4 25321.0 25473.5 25494.2 11:55:48 INFO - 2015-11-11 11:55:48,976 DEBUG : BROWSER_OUTPUT: 11:55:48 INFO - 2015-11-11 11:55:48,976 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:23773.73 Median:428.07 stddev:69784.39 (16302.0%) stddev-sans-first:69957.99 11:55:48 INFO - 2015-11-11 11:55:48,976 DEBUG : BROWSER_OUTPUT: Values: 352.6 355.7 356.8 357.8 360.8 11861.4 12341.4 16671.2 17273.0 17925.3 11467.9 11485.4 11498.5 11585.2 11834.3 4498.0 4585.5 4590.3 4602.0 4603.1 4459.8 4585.3 4588.8 4596.1 4596.7 4546.3 4553.8 4757.3 4882.8 4907.2 4874.1 4875.2 4875.7 4876.6 4878.4 4071.0 4148.9 4159.0 4171.8 4174.0 13517.0 13520.7 13805.4 13816.8 13875.2 1919.6 2008.9 2060.4 2070.8 2144.7 9631.7 9687.2 9703.2 9945.4 9997.0 1634.8 1648.3 1668.2 1704.7 1777.2 60654.7 61304.7 61587.4 62727.4 62996.4 6849.6 6949.2 6964.3 7005.4 7046.4 8364.2 8407.9 8434.3 8452.7 8460.8 5807.8 5831.4 5833.8 5856.0 5883.9 6108.3 6126.7 6139.5 6146.5 6181.8 3213.3 3238.5 3279.9 3285.4 3301.0 1144.1 1148.9 1161.1 1162.0 1211.2 388.9 397.2 403.4 407.7 425.6 9391.4 10138.1 10549.3 10559.0 10590.9 417.3 419.6 430.5 432.3 433.5 5488.8 5509.5 5556.1 5602.3 5652.3 388403.0 390557.0 392838.0 396532.0 528157.0 76614.6 77233.6 78412.0 78692.6 79513.4 439.1 450.1 453.1 453.5 455.5 9518.1 9555.5 9686.6 9909.5 10068.3 37265.8 37670.0 38251.8 38722.6 39013.6 49934.8 50286.7 50877.7 51070.2 51318.2 8050.6 8319.4 8361.2 8414.4 8504.6 11551.7 11841.6 11855.0 11868.5 11897.1 10320.9 10788.5 10908.3 10952.2 10971.8 10496.4 10777.9 10783.2 10919.7 11090.3 10618.3 10928.9 11053.2 11072.4 11145.8 7971.3 7986.8 8274.5 8388.9 8400.2 10629.7 10837.4 11005.0 11049.1 11100.8 11:55:48 INFO - 2015-11-11 11:55:48,976 DEBUG : BROWSER_OUTPUT: 11:55:48 INFO - 2015-11-11 11:55:48,976 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5480.09 Median:6398.89 stddev:2815.04 (44.0%) stddev-sans-first:2807.07 11:55:48 INFO - 2015-11-11 11:55:48,978 DEBUG : BROWSER_OUTPUT: Values: 1504.2 1693.6 1731.5 1755.8 1758.9 7304.9 7345.0 7467.5 7491.5 7602.0 7883.7 7914.6 7949.7 7962.3 7977.6 2287.8 2339.3 2345.6 2346.4 2355.6 2310.5 2336.8 2338.1 2339.6 2364.9 2215.2 2258.6 2261.1 2288.5 2312.8 2293.2 2304.9 2312.3 2314.8 2324.1 2253.8 2285.2 2286.3 2292.9 2297.5 7563.1 7619.8 7678.5 7694.4 7704.6 4647.6 4666.0 4715.4 4718.7 4735.5 3227.9 3247.5 3258.1 3272.9 3305.0 1034.3 1042.6 1064.8 1074.9 1153.8 10678.1 10702.7 10726.1 10750.1 10758.8 4078.5 4150.8 4209.7 4222.9 4230.9 8691.8 8697.7 8703.6 8724.3 8742.4 4574.3 4588.1 4589.8 4591.3 4607.3 4196.4 4204.9 4214.0 4221.3 4236.8 3501.8 3524.1 3543.9 3546.8 3578.5 1078.6 1093.4 1094.5 1095.4 1099.9 1016.9 1073.2 1076.7 1130.1 1211.3 7400.2 7424.9 7429.3 7448.7 7470.1 1131.4 1141.1 1152.3 1157.7 1172.5 5843.7 5889.8 5912.3 5918.3 5970.1 9398.6 9538.2 9603.4 9612.8 9626.4 9003.9 9160.3 9215.1 9296.7 9343.7 7324.5 7338.0 7361.3 7375.8 7401.7 7170.2 7343.3 7347.2 7360.5 7376.3 8157.6 8282.9 8337.7 8449.7 8524.4 8456.4 8486.1 8634.4 8644.4 8645.3 6897.5 6961.5 7038.3 7063.9 7091.2 7609.3 7681.1 7722.5 7728.1 7733.8 7138.4 7161.5 7196.0 7314.3 7319.2 6702.2 6727.5 6727.9 6732.9 6840.8 7118.6 7129.7 7144.4 7155.6 7161.6 6396.3 6502.6 6510.6 6523.1 6535.5 6401.5 6697.6 6752.3 6764.2 6764.7 11:55:48 INFO - 2015-11-11 11:55:48,978 DEBUG : BROWSER_OUTPUT: 11:55:48 INFO - 2015-11-11 11:55:48,978 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5398.35 Median:6097.78 stddev:1653.10 (27.1%) stddev-sans-first:1613.17 11:55:48 INFO - 2015-11-11 11:55:48,978 DEBUG : BROWSER_OUTPUT: Values: 318.9 323.8 326.7 329.3 333.4 6082.4 6096.2 6097.5 6098.1 6174.0 6001.7 6022.9 6034.2 6037.1 6048.7 4567.4 4578.0 4578.4 4584.0 4588.1 4582.4 4588.2 4589.2 4589.9 4607.1 4477.0 4533.3 4554.2 4608.1 4626.0 4584.9 4596.4 4616.8 4631.0 4632.1 3976.5 3982.8 3984.9 3993.8 3995.3 5737.8 5811.2 5814.9 5839.6 5857.3 5251.4 5297.2 5345.1 5345.7 5347.1 6412.9 6431.4 6448.4 6458.4 6458.6 4399.0 4399.1 4407.2 4416.6 4417.6 6567.4 6623.8 6679.3 6705.3 6724.0 4457.9 4481.8 4485.7 4487.5 4494.4 4552.6 4552.7 4558.9 4562.5 4568.4 5307.9 5310.5 5316.0 5335.8 5339.0 6400.6 6522.3 6528.0 6533.6 6534.4 1587.0 1612.7 1624.0 1631.8 1634.0 1049.5 1061.2 1070.5 1071.6 1080.7 6069.6 6074.9 6087.6 6130.4 6144.9 6471.5 6484.3 6504.7 6530.2 6533.2 6120.5 6163.8 6168.1 6197.2 6223.4 3671.8 3759.7 3762.8 3763.1 3763.8 7039.1 7046.2 7055.7 7065.6 7082.4 6805.6 6819.9 6882.4 6920.2 6929.7 6898.0 7089.0 7090.3 7097.7 7114.9 6687.7 6707.6 6768.5 6772.8 6784.6 6600.3 6671.0 6675.2 6679.3 6686.7 7010.0 7054.0 7072.8 7080.6 7087.3 4453.5 4489.8 4503.1 4513.8 4519.0 6654.7 6703.3 6712.0 6719.4 6777.0 6511.9 6513.8 6526.0 6566.9 6571.1 6463.8 6504.6 6517.4 6517.7 6522.2 6197.5 6337.7 6348.2 6353.4 6370.6 6487.4 6494.8 6497.9 6498.7 6531.2 6276.7 6299.7 6300.5 6307.0 6319.2 11:55:48 INFO - 2015-11-11 11:55:48,978 DEBUG : BROWSER_OUTPUT: 11:55:48 INFO - 2015-11-11 11:55:48,978 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:13895.84 Median:46932.53 stddev:16270.81 (34.7%) stddev-sans-first:16286.93 11:55:48 INFO - 2015-11-11 11:55:48,978 DEBUG : BROWSER_OUTPUT: Values: 844.4 846.9 848.1 852.9 871.7 13457.4 13507.3 13679.7 13800.4 13890.0 12889.7 12969.9 12976.7 13038.4 13328.0 793.6 812.2 813.8 814.2 814.7 813.3 816.5 818.2 822.6 823.8 846.7 847.8 851.5 855.0 857.5 843.8 851.3 851.6 851.7 853.5 623.1 625.2 625.4 625.5 626.6 11861.1 11881.5 11896.9 11939.3 12010.5 10867.5 11141.8 11261.5 11361.7 11448.2 9898.6 9954.8 9980.8 10003.2 10009.5 3547.7 3596.4 3631.7 3672.3 3709.7 46172.8 46484.0 46493.3 46589.8 47178.8 10139.8 10225.1 10269.1 10387.9 10431.7 18031.8 18089.8 18125.2 18131.1 18145.5 7696.4 7732.5 7915.6 8015.3 8140.8 4227.0 4265.0 4323.3 4328.5 4356.2 3129.7 3136.7 3142.1 3159.7 3179.7 490.5 492.7 506.2 507.0 514.6 661.5 666.0 666.9 668.8 732.4 8152.7 8286.3 8360.3 8461.5 8631.8 614.3 653.3 673.2 674.4 674.8 3986.7 4044.8 4074.7 4093.3 4171.2 57323.7 57406.1 57582.7 58180.7 60005.7 52041.0 52986.5 53083.0 53544.5 53675.2 43677.8 44685.0 48405.3 48951.5 49550.0 8704.8 8827.9 8858.7 8886.0 8913.9 36456.8 36858.4 36871.6 37190.4 37429.0 45944.8 46410.3 46686.3 47500.5 47849.8 8416.1 8516.5 8566.2 8579.2 8641.9 12786.4 12799.9 12950.9 12995.4 13004.7 11250.5 11250.7 11253.9 11345.5 12131.2 11668.4 11906.3 12004.2 12361.1 12404.9 11411.5 11552.8 11580.3 11867.1 11939.9 10063.4 10147.3 10182.5 10261.3 10627.9 8994.6 9487.6 9785.5 9804.5 9863.6 11:55:48 INFO - 2015-11-11 11:55:48,978 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 11:55:48 INFO - 2015-11-11 11:55:48,978 DEBUG : BROWSER_OUTPUT: 11:55:49 INFO - 2015-11-11 11:55:49,645 INFO : Browser exited with error code: 0 11:55:49 INFO - 2015-11-11 11:55:49,664 INFO : Completed test dromaeo_css (00:18:29) 11:55:49 INFO - 2015-11-11 11:55:49,664 INFO : Starting test kraken 11:55:49 INFO - 2015-11-11 11:55:49,664 DEBUG : operating with platform_type : linux_ 11:55:49 INFO - 2015-11-11 11:55:49,664 INFO : Initialising browser for kraken test... 11:55:49 INFO - 2015-11-11 11:55:49,670 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpFQE6cm/profile http://localhost:42812/getInfo.html 11:55:54 INFO - 2015-11-11 11:55:54,043 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 11:55:54 INFO - 2015-11-11 11:55:54,043 DEBUG : BROWSER_OUTPUT: colorDepth:24 11:55:54 INFO - 2015-11-11 11:55:54,043 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 11:55:54 INFO - 2015-11-11 11:55:54,044 DEBUG : BROWSER_OUTPUT: __metrics 11:55:55 INFO - 2015-11-11 11:55:55,021 INFO : Browser initialized. 11:55:55 INFO - 2015-11-11 11:55:55,022 INFO : Running cycle 1/1 for kraken test... 11:55:55 INFO - 2015-11-11 11:55:55,022 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpFQE6cm/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 11:56:06 INFO - 2015-11-11 11:56:06,824 DEBUG : BROWSER_OUTPUT: RSS: Main: 138653696 11:56:06 INFO - 2015-11-11 11:56:06,824 DEBUG : BROWSER_OUTPUT: 11:56:09 INFO - 2015-11-11 11:56:09,304 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:42812/tests/kraken/driver.html?testName=audio-beat-detection) 11:56:09 INFO - 2015-11-11 11:56:09,910 DEBUG : BROWSER_OUTPUT: RSS: Main: 141393920 11:56:09 INFO - 2015-11-11 11:56:09,910 DEBUG : BROWSER_OUTPUT: 11:56:12 INFO - 2015-11-11 11:56:12,529 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:42812/tests/kraken/driver.html?testName=audio-dft) 11:56:13 INFO - 2015-11-11 11:56:13,114 DEBUG : BROWSER_OUTPUT: RSS: Main: 140738560 11:56:13 INFO - 2015-11-11 11:56:13,115 DEBUG : BROWSER_OUTPUT: 11:56:15 INFO - 2015-11-11 11:56:15,961 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:42812/tests/kraken/driver.html?testName=audio-fft) 11:56:16 INFO - 2015-11-11 11:56:16,542 DEBUG : BROWSER_OUTPUT: RSS: Main: 135798784 11:56:16 INFO - 2015-11-11 11:56:16,543 DEBUG : BROWSER_OUTPUT: 11:56:18 INFO - 2015-11-11 11:56:18,617 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:42812/tests/kraken/driver.html?testName=audio-oscillator) 11:56:19 INFO - 2015-11-11 11:56:19,199 DEBUG : BROWSER_OUTPUT: RSS: Main: 136118272 11:56:19 INFO - 2015-11-11 11:56:19,199 DEBUG : BROWSER_OUTPUT: 11:56:21 INFO - 2015-11-11 11:56:21,372 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:42812/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:56:21 INFO - 2015-11-11 11:56:21,938 DEBUG : BROWSER_OUTPUT: RSS: Main: 136663040 11:56:21 INFO - 2015-11-11 11:56:21,939 DEBUG : BROWSER_OUTPUT: 11:56:24 INFO - 2015-11-11 11:56:24,950 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:42812/tests/kraken/driver.html?testName=imaging-darkroom) 11:56:25 INFO - 2015-11-11 11:56:25,544 DEBUG : BROWSER_OUTPUT: RSS: Main: 136183808 11:56:25 INFO - 2015-11-11 11:56:25,544 DEBUG : BROWSER_OUTPUT: 11:56:28 INFO - 2015-11-11 11:56:28,959 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:42812/tests/kraken/driver.html?testName=imaging-desaturate) 11:56:29 INFO - 2015-11-11 11:56:29,552 DEBUG : BROWSER_OUTPUT: RSS: Main: 137670656 11:56:29 INFO - 2015-11-11 11:56:29,552 DEBUG : BROWSER_OUTPUT: 11:56:32 INFO - 2015-11-11 11:56:32,399 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:42812/tests/kraken/driver.html?testName=json-parse-financial) 11:56:32 INFO - 2015-11-11 11:56:32,992 DEBUG : BROWSER_OUTPUT: RSS: Main: 137572352 11:56:32 INFO - 2015-11-11 11:56:32,992 DEBUG : BROWSER_OUTPUT: 11:56:34 INFO - 2015-11-11 11:56:34,600 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:42812/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:56:35 INFO - 2015-11-11 11:56:35,169 DEBUG : BROWSER_OUTPUT: RSS: Main: 138665984 11:56:35 INFO - 2015-11-11 11:56:35,169 DEBUG : BROWSER_OUTPUT: 11:56:36 INFO - 2015-11-11 11:56:36,980 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:42812/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:56:37 INFO - 2015-11-11 11:56:37,586 DEBUG : BROWSER_OUTPUT: RSS: Main: 138129408 11:56:37 INFO - 2015-11-11 11:56:37,586 DEBUG : BROWSER_OUTPUT: 11:56:39 INFO - 2015-11-11 11:56:39,684 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:42812/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:56:40 INFO - 2015-11-11 11:56:40,286 DEBUG : BROWSER_OUTPUT: RSS: Main: 137785344 11:56:40 INFO - 2015-11-11 11:56:40,286 DEBUG : BROWSER_OUTPUT: 11:56:42 INFO - 2015-11-11 11:56:42,781 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:42812/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:56:43 INFO - 2015-11-11 11:56:43,370 DEBUG : BROWSER_OUTPUT: RSS: Main: 138084352 11:56:43 INFO - 2015-11-11 11:56:43,371 DEBUG : BROWSER_OUTPUT: 11:56:45 INFO - 2015-11-11 11:56:45,939 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:42812/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:56:46 INFO - 2015-11-11 11:56:46,520 DEBUG : BROWSER_OUTPUT: RSS: Main: 139087872 11:56:46 INFO - 2015-11-11 11:56:46,520 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,202 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:42812/tests/kraken/driver.html?testName=ai-astar) 11:56:48 INFO - 2015-11-11 11:56:48,452 DEBUG : BROWSER_OUTPUT: RSS: Main: 137682944 11:56:48 INFO - 2015-11-11 11:56:48,452 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,455 DEBUG : BROWSER_OUTPUT: __start_tp_report 11:56:48 INFO - 2015-11-11 11:56:48,456 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 11:56:48 INFO - 2015-11-11 11:56:48,456 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 11:56:48 INFO - 2015-11-11 11:56:48,456 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 11:56:48 INFO - 2015-11-11 11:56:48,456 DEBUG : BROWSER_OUTPUT: |0;ai-astar;110;103;109;111;110;121;111;111;110;111 11:56:48 INFO - 2015-11-11 11:56:48,456 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;156;124;150;156;126;152;151;130;168;125 11:56:48 INFO - 2015-11-11 11:56:48,456 DEBUG : BROWSER_OUTPUT: |2;audio-dft;160;162;163;160;166;160;161;164;172;162 11:56:48 INFO - 2015-11-11 11:56:48,456 DEBUG : BROWSER_OUTPUT: |3;audio-fft;72;71;71;158;71;73;71;71;160;72 11:56:48 INFO - 2015-11-11 11:56:48,456 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;90;92;138;91;93;89;145;91;91;130 11:56:48 INFO - 2015-11-11 11:56:48,456 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;110;111;111;111;111;110;110;111;110;111 11:56:48 INFO - 2015-11-11 11:56:48,456 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;146;146;146;147;148;147;145;146;145;147 11:56:48 INFO - 2015-11-11 11:56:48,456 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;96;96;96;96;96;97;96;96;96;96 11:56:48 INFO - 2015-11-11 11:56:48,457 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;61;63;62;61;61;63;62;67;61;59 11:56:48 INFO - 2015-11-11 11:56:48,457 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;67;68;68;67;68;69;68;68;68;68 11:56:48 INFO - 2015-11-11 11:56:48,457 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;91;86;86;86;85;85;85;84;85;85 11:56:48 INFO - 2015-11-11 11:56:48,457 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;128;132;125;131;121;125;121;128;124;120 11:56:48 INFO - 2015-11-11 11:56:48,457 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;139;152;154;143;151;139;150;153;153;138 11:56:48 INFO - 2015-11-11 11:56:48,457 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;69;74;67;69;69;68;76;65;66;67 11:56:48 INFO - 2015-11-11 11:56:48,457 DEBUG : BROWSER_OUTPUT: __end_tp_report 11:56:48 INFO - 2015-11-11 11:56:48,457 DEBUG : BROWSER_OUTPUT: __start_cc_report 11:56:48 INFO - 2015-11-11 11:56:48,457 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,705 11:56:48 INFO - 2015-11-11 11:56:48,457 DEBUG : BROWSER_OUTPUT: __end_cc_report 11:56:48 INFO - 2015-11-11 11:56:48,457 DEBUG : BROWSER_OUTPUT: __startTimestamp1447271808453__endTimestamp 11:56:48 INFO - 2015-11-11 11:56:48,457 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,461 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 11:56:48 INFO - 2015-11-11 11:56:48,461 DEBUG : BROWSER_OUTPUT: Number of tests: 14 11:56:48 INFO - 2015-11-11 11:56:48,461 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,461 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:110.70 Median:111.00 stddev:4.35 (3.9%) stddev-sans-first:4.60 11:56:48 INFO - 2015-11-11 11:56:48,461 DEBUG : BROWSER_OUTPUT: Values: 110.0 103.0 109.0 111.0 110.0 121.0 111.0 111.0 110.0 111.0 11:56:48 INFO - 2015-11-11 11:56:48,461 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,461 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:143.80 Median:151.50 stddev:15.96 (10.5%) stddev-sans-first:16.31 11:56:48 INFO - 2015-11-11 11:56:48,461 DEBUG : BROWSER_OUTPUT: Values: 156.0 124.0 150.0 156.0 126.0 152.0 151.0 130.0 168.0 125.0 11:56:48 INFO - 2015-11-11 11:56:48,461 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,461 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:163.00 Median:162.50 stddev:3.71 (2.3%) stddev-sans-first:3.77 11:56:48 INFO - 2015-11-11 11:56:48,462 DEBUG : BROWSER_OUTPUT: Values: 160.0 162.0 163.0 160.0 166.0 160.0 161.0 164.0 172.0 162.0 11:56:48 INFO - 2015-11-11 11:56:48,462 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,462 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:89.00 Median:71.00 stddev:36.90 (52.0%) stddev-sans-first:38.62 11:56:48 INFO - 2015-11-11 11:56:48,462 DEBUG : BROWSER_OUTPUT: Values: 72.0 71.0 71.0 158.0 71.0 73.0 71.0 71.0 160.0 72.0 11:56:48 INFO - 2015-11-11 11:56:48,462 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,462 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:105.00 Median:91.00 stddev:22.84 (25.1%) stddev-sans-first:23.57 11:56:48 INFO - 2015-11-11 11:56:48,462 DEBUG : BROWSER_OUTPUT: Values: 90.0 92.0 138.0 91.0 93.0 89.0 145.0 91.0 91.0 130.0 11:56:48 INFO - 2015-11-11 11:56:48,462 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,462 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:110.60 Median:111.00 stddev:0.52 (0.5%) stddev-sans-first:0.50 11:56:48 INFO - 2015-11-11 11:56:48,462 DEBUG : BROWSER_OUTPUT: Values: 110.0 111.0 111.0 111.0 111.0 110.0 110.0 111.0 110.0 111.0 11:56:48 INFO - 2015-11-11 11:56:48,462 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,463 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:146.30 Median:146.50 stddev:0.95 (0.6%) stddev-sans-first:1.00 11:56:48 INFO - 2015-11-11 11:56:48,463 DEBUG : BROWSER_OUTPUT: Values: 146.0 146.0 146.0 147.0 148.0 147.0 145.0 146.0 145.0 147.0 11:56:48 INFO - 2015-11-11 11:56:48,463 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,463 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:96.10 Median:96.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 11:56:48 INFO - 2015-11-11 11:56:48,463 DEBUG : BROWSER_OUTPUT: Values: 96.0 96.0 96.0 96.0 96.0 97.0 96.0 96.0 96.0 96.0 11:56:48 INFO - 2015-11-11 11:56:48,463 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,464 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:62.00 Median:62.00 stddev:2.11 (3.4%) stddev-sans-first:2.20 11:56:48 INFO - 2015-11-11 11:56:48,464 DEBUG : BROWSER_OUTPUT: Values: 61.0 63.0 62.0 61.0 61.0 63.0 62.0 67.0 61.0 59.0 11:56:48 INFO - 2015-11-11 11:56:48,464 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,464 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.90 Median:68.00 stddev:0.57 (0.8%) stddev-sans-first:0.50 11:56:48 INFO - 2015-11-11 11:56:48,464 DEBUG : BROWSER_OUTPUT: Values: 67.0 68.0 68.0 67.0 68.0 69.0 68.0 68.0 68.0 68.0 11:56:48 INFO - 2015-11-11 11:56:48,464 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,465 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:85.80 Median:85.50 stddev:1.93 (2.3%) stddev-sans-first:0.67 11:56:48 INFO - 2015-11-11 11:56:48,465 DEBUG : BROWSER_OUTPUT: Values: 91.0 86.0 86.0 86.0 85.0 85.0 85.0 84.0 85.0 85.0 11:56:48 INFO - 2015-11-11 11:56:48,465 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,465 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:125.50 Median:126.50 stddev:4.20 (3.3%) stddev-sans-first:4.35 11:56:48 INFO - 2015-11-11 11:56:48,465 DEBUG : BROWSER_OUTPUT: Values: 128.0 132.0 125.0 131.0 121.0 125.0 121.0 128.0 124.0 120.0 11:56:48 INFO - 2015-11-11 11:56:48,465 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,466 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:147.20 Median:151.50 stddev:6.63 (4.4%) stddev-sans-first:6.33 11:56:48 INFO - 2015-11-11 11:56:48,466 DEBUG : BROWSER_OUTPUT: Values: 139.0 152.0 154.0 143.0 151.0 139.0 150.0 153.0 153.0 138.0 11:56:48 INFO - 2015-11-11 11:56:48,466 DEBUG : BROWSER_OUTPUT: 11:56:48 INFO - 2015-11-11 11:56:48,466 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.00 Median:69.00 stddev:3.46 (5.0%) stddev-sans-first:3.67 11:56:48 INFO - 2015-11-11 11:56:48,466 DEBUG : BROWSER_OUTPUT: Values: 69.0 74.0 67.0 69.0 69.0 68.0 76.0 65.0 66.0 67.0 11:56:48 INFO - 2015-11-11 11:56:48,466 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 11:56:48 INFO - 2015-11-11 11:56:48,466 DEBUG : BROWSER_OUTPUT: 11:56:49 INFO - 2015-11-11 11:56:49,449 INFO : Browser exited with error code: 0 11:56:49 INFO - 2015-11-11 11:56:49,502 INFO : Completed test kraken (00:00:59) 11:56:49 INFO - 2015-11-11 11:56:49,502 INFO : Starting test v8_7 11:56:49 INFO - 2015-11-11 11:56:49,502 DEBUG : operating with platform_type : linux_ 11:56:49 INFO - 2015-11-11 11:56:49,502 INFO : Initialising browser for v8_7 test... 11:56:49 INFO - 2015-11-11 11:56:49,508 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpaTMsKD/profile http://localhost:42812/getInfo.html 11:56:53 INFO - 2015-11-11 11:56:53,920 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 11:56:53 INFO - 2015-11-11 11:56:53,920 DEBUG : BROWSER_OUTPUT: colorDepth:24 11:56:53 INFO - 2015-11-11 11:56:53,920 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 11:56:53 INFO - 2015-11-11 11:56:53,921 DEBUG : BROWSER_OUTPUT: __metrics 11:56:54 INFO - 2015-11-11 11:56:54,917 INFO : Browser initialized. 11:56:54 INFO - 2015-11-11 11:56:54,918 INFO : Running cycle 1/1 for v8_7 test... 11:56:54 INFO - 2015-11-11 11:56:54,918 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpaTMsKD/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 11:57:06 INFO - 2015-11-11 11:57:06,719 DEBUG : BROWSER_OUTPUT: RSS: Main: 138608640 11:57:06 INFO - 2015-11-11 11:57:06,719 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,068 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:42812/tests/v8_7/run.html (next: http://localhost:42812/tests/v8_7/run.html) 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: RSS: Main: 137670656 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: __start_tp_report 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: |0;Richards;162.44314489928524 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;194.3634596695821 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: |2;Encrypt;281.6901408450704 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5086.294416243655 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1062.6992561105208 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: |5;Earley;713.7758743754462 11:57:28 INFO - 2015-11-11 11:57:28,314 DEBUG : BROWSER_OUTPUT: |6;Boyer;11697.67441860465 11:57:28 INFO - 2015-11-11 11:57:28,315 DEBUG : BROWSER_OUTPUT: |7;RegExp;25075 11:57:28 INFO - 2015-11-11 11:57:28,315 DEBUG : BROWSER_OUTPUT: |8;Splay;611.2469437652812 11:57:28 INFO - 2015-11-11 11:57:28,315 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4873.78640776699 11:57:28 INFO - 2015-11-11 11:57:28,315 DEBUG : BROWSER_OUTPUT: __end_tp_report 11:57:28 INFO - 2015-11-11 11:57:28,315 DEBUG : BROWSER_OUTPUT: __startTimestamp1447271848313__endTimestamp 11:57:28 INFO - 2015-11-11 11:57:28,315 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,315 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 11:57:28 INFO - 2015-11-11 11:57:28,316 DEBUG : BROWSER_OUTPUT: Number of tests: 10 11:57:28 INFO - 2015-11-11 11:57:28,316 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,316 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:162.44 Median:162.44 stddev:0.00 (0.0%) 11:57:28 INFO - 2015-11-11 11:57:28,316 DEBUG : BROWSER_OUTPUT: Values: 162.4 11:57:28 INFO - 2015-11-11 11:57:28,316 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,316 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:194.36 Median:194.36 stddev:0.00 (0.0%) 11:57:28 INFO - 2015-11-11 11:57:28,316 DEBUG : BROWSER_OUTPUT: Values: 194.4 11:57:28 INFO - 2015-11-11 11:57:28,316 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,316 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:281.69 Median:281.69 stddev:0.00 (0.0%) 11:57:28 INFO - 2015-11-11 11:57:28,316 DEBUG : BROWSER_OUTPUT: Values: 281.7 11:57:28 INFO - 2015-11-11 11:57:28,317 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,317 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5086.29 Median:5086.29 stddev:0.00 (0.0%) 11:57:28 INFO - 2015-11-11 11:57:28,317 DEBUG : BROWSER_OUTPUT: Values: 5086.3 11:57:28 INFO - 2015-11-11 11:57:28,317 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,317 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1062.70 Median:1062.70 stddev:0.00 (0.0%) 11:57:28 INFO - 2015-11-11 11:57:28,317 DEBUG : BROWSER_OUTPUT: Values: 1062.7 11:57:28 INFO - 2015-11-11 11:57:28,317 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,317 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:713.78 Median:713.78 stddev:0.00 (0.0%) 11:57:28 INFO - 2015-11-11 11:57:28,317 DEBUG : BROWSER_OUTPUT: Values: 713.8 11:57:28 INFO - 2015-11-11 11:57:28,317 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,317 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:11697.67 Median:11697.67 stddev:0.00 (0.0%) 11:57:28 INFO - 2015-11-11 11:57:28,317 DEBUG : BROWSER_OUTPUT: Values: 11697.7 11:57:28 INFO - 2015-11-11 11:57:28,318 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,318 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:25075.00 Median:25075.00 stddev:0.00 (0.0%) 11:57:28 INFO - 2015-11-11 11:57:28,318 DEBUG : BROWSER_OUTPUT: Values: 25075.0 11:57:28 INFO - 2015-11-11 11:57:28,318 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,318 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:611.25 Median:611.25 stddev:0.00 (0.0%) 11:57:28 INFO - 2015-11-11 11:57:28,318 DEBUG : BROWSER_OUTPUT: Values: 611.2 11:57:28 INFO - 2015-11-11 11:57:28,318 DEBUG : BROWSER_OUTPUT: 11:57:28 INFO - 2015-11-11 11:57:28,318 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4873.79 Median:4873.79 stddev:0.00 (0.0%) 11:57:28 INFO - 2015-11-11 11:57:28,319 DEBUG : BROWSER_OUTPUT: Values: 4873.8 11:57:28 INFO - 2015-11-11 11:57:28,319 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 11:57:28 INFO - 2015-11-11 11:57:28,319 DEBUG : BROWSER_OUTPUT: 11:57:29 INFO - 2015-11-11 11:57:29,197 INFO : Browser exited with error code: 0 11:57:29 INFO - 2015-11-11 11:57:29,212 INFO : Completed test v8_7 (00:00:39) 11:57:29 INFO - 2015-11-11 11:57:29,415 INFO : Completed test suite (00:20:09) 11:57:29 INFO - 2015-11-11 11:57:29,415 DEBUG : Working with test: dromaeo_css 11:57:29 INFO - 2015-11-11 11:57:29,415 DEBUG : Generating results file: dromaeo_css 11:57:29 INFO - 2015-11-11 11:57:29,416 DEBUG : Working with test: kraken 11:57:29 INFO - 2015-11-11 11:57:29,416 DEBUG : Generating results file: kraken 11:57:29 INFO - 2015-11-11 11:57:29,417 INFO : javascript benchmark 11:57:29 INFO - 2015-11-11 11:57:29,417 DEBUG : Working with test: v8_7 11:57:29 INFO - 2015-11-11 11:57:29,417 DEBUG : Generating results file: v8_7 11:57:29 INFO - 2015-11-11 11:57:29,417 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:57:29 INFO - 2015-11-11 11:57:29,471 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,43]] 11:57:29 INFO - 2015-11-11 11:57:29,471 DEBUG : process_Request line: dromaeo_css 6785.48 graph.html#tests=[[72,64,43]] 11:57:29 INFO - 2015-11-11 11:57:29,471 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:57:29 INFO - 2015-11-11 11:57:29,502 DEBUG : process_Request line: kraken 1521.90 graph.html#tests=[[232,64,43]] 11:57:29 INFO - 2015-11-11 11:57:29,502 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 11:57:29 INFO - 2015-11-11 11:57:29,532 DEBUG : process_Request line: v8_7 21464.90 graph.html#tests=[[230,64,43]] 11:57:29 INFO - 2015-11-11 11:57:29,534 INFO : javascript benchmark 11:57:29 INFO - 2015-11-11 11:57:29,538 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [352.57162547504777, 355.65856777493605, 356.78949419842286, 357.7567254267099, 360.7889384709945, 11861.406929653525, 12341.382930853444, 16671.249793759296, 17273.0, 17925.282988680454, 11467.885321146787, 11485.425728713573, 11498.540058397675, 11585.246958947662, 11834.28994260345, 4497.977510112445, 4585.4726706428855, 4590.311453282001, 4601.976990115061, 4603.10239503297, 4459.777011149446, 4585.335126406669, 4588.77056147193, 4596.080783843245, 4596.724196548218, 4546.29532422475, 4553.772311384434, 4757.333973243749, 4882.780274887638, 4907.190313598252, 4874.073925954058, 4875.171220892439, 4875.683080599767, 4876.634252431064, 4878.390201224847, 4070.9796451017555, 4148.91702165958, 4159.0, 4171.833126674929, 4174.0, 13517.0, 13520.661983450394, 13805.447782088704, 13816.792748108786, 13875.167489950636, 1919.6256729937668, 2008.8694234874686, 2060.3612880007095, 2070.8032736890123, 2144.654993521357, 9631.662891798753, 9687.225021998223, 9703.223742100616, 9945.353552019167, 9997.000299970017, 1634.7547867819803, 1648.3406637345038, 1668.1575804218912, 1704.701677206484, 1777.2269062957655, 60654.69672651653, 61304.693476532775, 61587.38412615861, 62727.37272627261, 62996.370036299966, 6849.623270720059, 6949.2008419031445, 6964.268751781091, 7005.404540614105, 7046.401055910203, 8364.163583641708, 8407.915920840836, 8434.283085937765, 8452.704155354533, 8460.830783384297, 5807.796727114531, 5831.3877042910735, 5833.82498525045, 5855.970720146372, 5883.882322353529, 6108.267007959073, 6126.724297406628, 6139.539534534928, 6146.508279337642, 6181.81454556364, 3213.2770126721302, 3238.5304130900886, 3279.9016029519153, 3285.375778602058, 3300.966990330066, 1144.0904480937675, 1148.8908553687386, 1161.1233518693332, 1161.976760464786, 1211.1703483114095, 388.88139117568846, 397.2214459659043, 403.4231049599101, 407.66367746609166, 425.6467132280262, 9391.436513809193, 10138.138258247984, 10549.261551691308, 10559.04968552834, 10590.894091059145, 417.2781088716537, 419.5552714123039, 430.4984692832877, 432.25220368762217, 433.5079684558049, 5488.780448782084, 5509.47659972302, 5556.111022236423, 5602.2717046783655, 5652.2652055233375, 388403.0, 390557.0, 392838.0, 396532.0, 528157.0, 76614.61692691501, 77233.61383193047, 78412.0, 78692.60653696809, 79513.44622260876, 439.0976543203683, 450.1245078322631, 453.07572551993565, 453.46491140453924, 455.53990469625916, 9518.095780900803, 9555.474448905377, 9686.612535498502, 9909.536806494565, 10068.345557538736, 37265.81367093147, 37670.0, 38251.80874095612, 38722.61277387303, 39013.60986390214, 49934.75032624959, 50286.7485662584, 50877.745611271705, 51070.23394649158, 51318.230226545886, 8050.597470126353, 8319.376046796393, 8361.16388361159, 8414.368922330972, 8504.617292221741, 11551.71120721955, 11841.5855445059, 11855.0, 11868.525258989544, 11897.107716921093, 10320.896791031993, 10788.514516846604, 10908.34549927007, 10952.178586606196, 10971.83542246851, 10496.422696751752, 10777.89222107769, 10783.245172837826, 10919.727006824893, 11090.334579925231, 10618.256722029384, 10928.890711092787, 11053.226274161054, 11072.39101849406, 11145.777084458428, 7971.322437592869, 7986.763706162284, 8274.462159959825, 8388.916110839058, 8400.159984001551, 10629.681109566725, 10837.403942783223, 11005.0, 11049.060829829234, 11100.777984440427], "dojo.html": [3192.6009248843893, 3261.4292498812715, 3274.5088236764495, 3290.4735242361226, 3297.2581169236923, 5426.484483974026, 5490.313710786152, 5522.254495643087, 5526.917096243555, 5586.692731899749, 5435.537979271767, 5489.3961664217, 5523.199136125259, 5544.972275138619, 5563.944360556393, 4992.151334273164, 5000.224965130411, 5169.121249387595, 5176.637635365526, 5190.740462976855, 4890.633202509808, 5066.544011039005, 5114.718690472023, 5153.81961631343, 5162.741862906859, 4975.179095449264, 5029.069622119901, 5081.8475445736685, 5099.668521546125, 5130.769115389817, 5053.5957123430035, 5083.110455670243, 5090.236464530313, 5116.6674166179455, 5123.3339665843205, 4926.827561035382, 5017.974910125463, 5060.898782024339, 5067.5185857343495, 5079.288899554065, 5227.581793456515, 5281.207818827168, 5326.627136100475, 5339.5461385782255, 5411.323584551931, 5983.6110652807865, 6011.879762404771, 6013.067974463965, 6014.51883849291, 6025.276966763972, 5774.624649397776, 5932.436418540232, 5946.7026648667825, 6038.064100064497, 6042.12389203563, 5641.605087643867, 5686.061799802987, 5688.857778555569, 5692.886142277172, 5712.485876271114, 6118.663473509, 6151.446369826737, 6164.321924588381, 6167.074938759132, 6183.041628547582, 5763.308402991668, 5834.474897259182, 5868.2664666916635, 5924.289085309791, 5944.554158438134, 5987.970060149759, 5989.981703110481, 6013.067974463965, 6031.638101713911, 6038.698065096728, 5971.343152253248, 5980.760769569256, 5995.0, 6012.158297838306, 6015.909761353583, 5875.294964604275, 5890.352061273256, 5985.431384018511, 6001.759929602855, 6012.669303188367, 4651.976740116278, 4660.277656963176, 4667.696599721007, 4675.064987002613, 4704.529547045337, 4134.875953721393, 4138.02756352257, 4149.8340066397, 4152.688548358885, 4154.459920210354, 5459.535939445192, 5655.688937108416, 5665.801696940587, 5774.0, 5789.189513468118, 6011.879762404727, 6042.637441753509, 6070.332263451017, 6073.817785466443, 6074.0, 5543.057680194376, 5744.885102298014, 5746.2529871116485, 5746.396628354046, 5759.827205183851, 5129.333186685782, 5179.964007198575, 5207.791688332424, 5209.973950130225, 5245.527902488794, 6156.168917196211, 6247.625142491465, 6272.937270627326, 6281.0, 6288.811335659938, 5863.794767183128, 6058.57589968698, 6060.181875446935, 6065.939340606537, 6084.056971169299, 6135.6932153393045, 6198.2252218472695, 6287.96856015717, 6309.7160627770945, 6325.146105275729, 5874.295084589877, 5892.9116063258225, 5908.527317814479, 5913.113033045078, 5927.585069045125, 5900.586958912835, 5992.221011268507, 6002.0, 6003.279606447254, 6022.0, 5773.624714393551, 5852.912206316993, 5875.970620146872, 5892.852678682896, 5909.143174239797, 5732.914006289826, 5752.050911599539, 5770.13447982806, 5820.388859169726, 5843.707814609337, 5643.887122257614, 5676.17695434168, 5732.570057245806, 5736.68448235351, 5785.884282314414, 5868.2664666916635, 5942.64344139353, 5954.612950158225, 5976.521878249817, 5984.790532331347, 5816.680082595329, 5823.854403639943, 5826.271716035496, 5837.270341207349, 5837.970810146092], "mootools.html": [1504.1802217791303, 1693.5681401242684, 1731.5151757507895, 1755.754194412782, 1758.9032603206826, 7304.890426643591, 7345.0, 7467.477276590641, 7491.513051651639, 7601.961990190041, 7883.684652613889, 7914.604269786502, 7949.721759738411, 7962.323202527792, 7977.641006154722, 2287.7712228777114, 2339.30990357844, 2345.6129738593195, 2346.389938615955, 2355.5759963206615, 2310.5378924215142, 2336.8247381446376, 2338.053088499152, 2339.5554844579474, 2364.9054037838464, 2215.235743668432, 2258.559580881729, 2261.1294651559106, 2288.4622113803243, 2312.838101332907, 2293.185918998748, 2304.9078036878673, 2312.306308107561, 2314.8032417244553, 2324.1284518305633, 2253.785890340415, 2285.1544928376607, 2286.3369622809364, 2292.86242825431, 2297.4945511987335, 7563.130240022413, 7619.771406857803, 7678.500897441649, 7694.384449244047, 7704.6147692615705, 4647.55848194421, 4666.0, 4715.41057367829, 4718.7168769873915, 4735.455422626374, 3227.9031629051165, 3247.4641684122093, 3258.0877354340823, 3272.8690852365876, 3305.0415379539904, 1034.2863424237328, 1042.5673345561584, 1064.8455973883742, 1074.9032587067202, 1153.8384626152344, 10678.092362149227, 10702.678919632346, 10726.14190864721, 10750.139988800876, 10758.838617420744, 4078.5105787305715, 4150.771707556113, 4209.684273679486, 4222.894427639334, 4230.915381692349, 8691.826163476822, 8697.652093916298, 8703.564821758886, 8724.258438032712, 8742.431741936882, 4574.336721175411, 4588.059447813191, 4589.770511474413, 4591.311303304531, 4607.3089036644105, 4196.370544418301, 4204.8528301509305, 4214.0, 4221.261279276115, 4236.809343579546, 3501.824908754552, 3524.0837382280793, 3543.8759643412873, 3546.840392182358, 3578.5169002184894, 1078.5685725709623, 1093.4314156638504, 1094.5293523784849, 1095.370162156763, 1099.8735145458375, 1016.8627235323137, 1073.1736562846565, 1076.7308172956762, 1130.141092769501, 1211.2913945341897, 7400.185979542246, 7424.888626670604, 7429.257074292527, 7448.702051917862, 7470.140933792683, 1131.3947038334616, 1141.1315639980473, 1152.3086148311113, 1157.7105723569107, 1172.4782471800138, 5843.737031833578, 5889.793857214977, 5912.320083190488, 5918.319393269829, 5970.0746384310505, 9398.624055037859, 9538.236941044699, 9603.37578057424, 9612.807743845084, 9626.422414655142, 9003.864942025875, 9160.267178625694, 9215.078492150866, 9296.67461638853, 9343.672971446103, 7324.4872858900435, 7338.0, 7361.300676435837, 7375.778726638209, 7401.666924988388, 7170.2471240519, 7343.3390994810725, 7347.228541003117, 7360.5215660984, 7376.299251571092, 8157.632906519102, 8282.875756863772, 8337.66649334044, 8449.746507604536, 8524.36067294943, 8456.40805143634, 8486.10895855951, 8634.352423568384, 8644.394892357475, 8645.308375330083, 6897.48268879826, 6961.547499412522, 7038.2961703829205, 7063.894041589483, 7091.219965803861, 7609.277118673717, 7681.078270607562, 7722.459427839997, 7728.149903510497, 7733.845323093394, 7138.39323657495, 7161.4986950912935, 7196.0, 7314.268573142643, 7319.2314806944505, 6702.229243637044, 6727.529072964846, 6727.865442691216, 6732.865342693217, 6840.794776156723, 7118.644067796693, 7129.714811407485, 7144.428445724226, 7155.642217888981, 7161.57030578167, 6396.32838551964, 6502.642354670538, 6510.576812507361, 6523.11937888398, 6535.509836762167, 6401.455876250571, 6697.598144111369, 6752.291009444134, 6764.222114456704, 6764.661766911537], "ext.html": [559.9776008959642, 564.9265595472585, 570.3583468597827, 571.3429556010587, 583.7344008476143, 31746.841265793668, 32423.83788081059, 39333.40999885, 40157.0, 40403.393949090714, 42929.7853510732, 43356.78321608395, 43559.34660980088, 43800.0, 43809.342859857126, 8626.18051285127, 8786.736397908073, 8788.296936245117, 8795.648174073029, 8812.735617931472, 8555.743327700147, 8587.012493563227, 8664.306855451548, 8664.740057798244, 8677.045524992245, 8659.870101948476, 8700.434471759347, 8716.607752651114, 8759.824803503927, 8767.079456657055, 8682.218600325969, 8707.60815763289, 8740.47557146567, 8774.824503509957, 8775.385722999392, 8529.786755331104, 8593.699220527315, 8614.87077693835, 8675.43609665376, 8700.434471759316, 39767.8011609943, 40075.59924400777, 40213.0, 40260.0, 40276.79861600673, 3253.5770349854606, 3418.6581341865863, 3526.717862570988, 3837.3668344723087, 3971.801409929492, 30031.549526757117, 30147.0, 30338.84830575833, 30345.393092138256, 31447.685523144704, 3470.7049900758466, 3533.152043509565, 3545.7163426925786, 3579.49887015818, 3682.208325210093, 271611.0, 273762.0, 274285.0, 274512.0, 449973.99999999674, 59132.40867591269, 59740.70129649324, 59822.70088649529, 59910.40089599048, 59935.10097348543, 63887.36112638907, 63926.36073639204, 64053.47705876128, 64310.67844660747, 64563.0, 15833.841661583238, 15998.0, 16097.436589719304, 16098.0, 16144.434944776876, 11283.0, 11322.207445478902, 11325.15061370384, 11386.373749443861, 11392.487338069806, 19629.705554416694, 20348.796512034987, 20444.28445004418, 20488.59022819565, 20593.279235226993, 8020.839583208303, 8065.7176998805935, 8199.303059240032, 8208.958955205306, 8340.37447191463, 931.1573026411108, 937.1378331934636, 986.9851952220722, 1055.614700634263, 1063.5107850388754, 28107.859460702974, 28181.0, 28327.858360708065, 28399.858000709864, 28655.426891462055, 1024.155072065549, 1047.450088703437, 1053.0627741310086, 1141.4349896801136, 1145.971350716222, 14451.855481445262, 14473.638159046108, 14622.780658290134, 14911.478098266725, 14922.0, 312143.0, 315536.0, 316195.0, 316814.0, 317174.0, 50574.747126264134, 51174.48825511697, 51208.0, 51377.7431112842, 51475.227871581956, 1339.9330033498286, 1348.8381394232754, 1349.9392527336292, 1352.783554631274, 1357.0704067713648, 27473.587896181973, 27541.724582754716, 27779.166625001282, 28116.85941570279, 28283.43433131285, 45713.77143114396, 46165.76917115393, 46301.76849115733, 46531.302030470244, 46744.53255467402, 293821.0, 294434.0, 295838.0, 296142.0, 297897.0, 32217.838910805294, 42584.36123458089, 43258.0, 43467.782661086494, 43618.0, 43334.133317334105, 44278.33582496201, 44341.77829110834, 44387.55612443834, 45344.773276133405, 36532.0, 36736.448953265186, 37263.25473490569, 37930.241395172496, 38173.61826381701, 37165.0, 37267.25465490621, 37596.62403375931, 37725.62274377331, 37994.620053800216, 36655.26689466249, 36766.816165919, 36835.63164368429, 40396.3940540898, 41291.58708412998, 31840.52239216367, 33624.49563256504, 33717.0, 33937.0, 35681.46477802887, 24815.87592062028, 25144.37139071538, 25321.0, 25473.49053018966, 25494.235172944842], "prototype.html": [318.8899829558802, 323.7604172912046, 326.68801294763506, 329.32652725177, 333.3715945442841, 6082.391760823921, 6096.207493025906, 6097.4817140543055, 6098.085287206921, 6173.969130154354, 6001.699915004254, 6022.939770602293, 6034.24571928509, 6037.0642550404755, 6048.667323297217, 4567.4062371891605, 4577.977110114445, 4578.404807375045, 4583.977080114595, 4588.059447813207, 4582.404287442644, 4588.197065513538, 4589.2198326284615, 4589.885252868671, 4607.124646317189, 4476.9776151119195, 4533.3426653135275, 4554.157480866033, 4608.055348653518, 4625.953740462586, 4584.862454126348, 4596.448426188878, 4616.8153273869, 4631.0, 4632.143053535106, 3976.5426975897853, 3982.8406863725418, 3984.920301593952, 3993.820278087493, 3995.2808494470983, 5737.770489180428, 5811.157382179603, 5814.912776308359, 5839.620424672383, 5857.326407463111, 5251.4485978972425, 5297.205419187114, 5345.118055520835, 5345.65253258537, 5347.144456886918, 6412.903806442907, 6431.389018043278, 6448.355164483561, 6458.354164583551, 6458.580192287486, 4398.956010439919, 4399.098184872094, 4407.206702793496, 4416.624586910117, 4417.624501917341, 6567.408933196035, 6623.801285961429, 6679.33206679333, 6705.2624211336715, 6724.025016372648, 4457.9331310030375, 4481.775911204427, 4485.6860019798305, 4487.528809475023, 4494.438195225597, 4552.613027892667, 4552.749598772033, 4558.8632341029825, 4562.543745625478, 4568.428946381702, 5307.938412317475, 5310.495502927216, 5316.016536940679, 5335.759890804923, 5339.0, 6400.583962042452, 6522.347765223534, 6527.967360163264, 6533.607983521004, 6534.411902928759, 1586.9603259918363, 1612.6613411183548, 1624.0255846492246, 1631.8087795909053, 1634.035918807909, 1049.5486940615456, 1061.2040969273046, 1070.5289672544056, 1071.603506702525, 1080.6757972608186, 6069.605475644069, 6074.878502429927, 6087.573869829158, 6130.386961303834, 6144.9246381882995, 6471.546991710535, 6484.319146489645, 6504.707288172043, 6530.216374035146, 6533.150690410216, 6120.479759220427, 6163.8150855474405, 6168.074788781719, 6197.163382943335, 6223.408776166257, 3671.81640917953, 3759.661630453272, 3762.795905310329, 3763.1156678180605, 3763.8306276217636, 7039.120109986252, 7046.224915259318, 7055.717771289091, 7065.6113913735235, 7082.39799617028, 6805.625690587065, 6819.863602727918, 6882.4149947254045, 6920.204176519664, 6929.688164032631, 6898.0, 7089.042979197846, 7090.326418990187, 7097.680604372712, 7114.893276600855, 6687.665616719048, 6707.564008339442, 6768.458523318024, 6772.796816095525, 6784.626845523346, 6600.273969863215, 6671.0, 6675.198976122896, 6679.265280819203, 6686.732530698718, 7010.0, 7054.047703559953, 7072.823179420556, 7080.645967701491, 7087.291270872872, 4453.465584129925, 4489.775511224491, 4503.121891231179, 4513.774311284488, 4518.9832287735, 6654.700538475683, 6703.3296670332575, 6712.0, 6719.361660642231, 6776.966115169393, 6511.869762604816, 6513.772017979348, 6526.0, 6566.9343306568235, 6571.112899758471, 6463.7737679181, 6504.642244676588, 6517.4460170886005, 6517.706703198272, 6522.15212022434, 6197.4732147767945, 6337.651429171256, 6348.238211414475, 6353.428191462791, 6370.649614271259, 6487.416132548094, 6494.837629059311, 6497.870042599027, 6498.707558159799, 6531.2489063756375, 6276.686165691788, 6299.6535190564955, 6300.527460440394, 6307.022411526221, 6319.210098737658], "yui.html": [844.3878188313472, 846.9110743371946, 848.1094850407073, 852.9402941794077, 871.6992637540051, 13457.394417251222, 13507.25710085946, 13679.726405471885, 13800.378982945766, 13890.0, 12889.742205155891, 12969.870301296984, 12976.675583110427, 13038.413271402786, 13328.0, 793.5714714054403, 812.2486699802688, 813.8494378539959, 814.1614137438448, 814.6578437056451, 813.2964985287713, 816.4652152839899, 818.1572979830754, 822.5640410582371, 823.8105235795771, 846.720582207873, 847.8134810341714, 851.5486792000249, 854.9529775862325, 857.5197889182047, 843.7595285343679, 851.3146916732028, 851.5571902610639, 851.7061613743249, 853.4921721575653, 623.0778447897093, 625.1778910732418, 625.424609359386, 625.5214760708062, 626.589583822597, 11861.11041671878, 11881.524739010429, 11896.940515297454, 11939.283642981449, 12010.459529321202, 10867.45662716861, 11141.832872506919, 11261.54953801847, 11361.659150225507, 11448.198626096177, 9898.554565044518, 9954.800903981879, 9980.750481238027, 10003.199744020461, 10009.499525023719, 3547.6807087362004, 3596.388613935611, 3631.6731494165388, 3672.2839046385966, 3709.7217708671687, 46172.845678857964, 46484.0, 46493.30260046102, 46589.76705116487, 47178.76410617925, 10139.847902281472, 10225.130863876653, 10269.127124194378, 10387.94806025965, 10431.68704938853, 18031.819681803016, 18089.819101809077, 18125.18436670353, 18131.093445327682, 18145.45563633093, 7696.384289256846, 7732.458727888994, 7915.604219788987, 8015.278624923785, 8140.75577732669, 4227.0, 4265.0, 4323.329883867943, 4328.545502722169, 4356.172327257874, 3129.6870312968977, 3136.7490600751885, 3142.0573827851554, 3159.7156255936616, 3179.713825755693, 490.4800911034315, 492.7019153412134, 506.154721614904, 507.0163882068775, 514.6474664854586, 661.5336187987457, 665.9533832631766, 666.8566258254401, 668.8093893240404, 732.4250463386217, 8152.714654987047, 8286.295664868554, 8360.28937540316, 8461.534615596202, 8631.827363452696, 614.3426533609085, 653.3009679642737, 673.1585518102372, 674.4267372733235, 674.7975607317785, 3986.7307320411123, 4044.8179831907637, 4074.6740260779065, 4093.263212621697, 4171.186618609403, 57323.713381432826, 57406.138907916415, 57582.7120864393, 58180.709096454244, 60005.69997149986, 52041.0, 52986.47013529892, 53082.957119073624, 53544.46455535472, 53675.19487207695, 43677.781611092374, 44685.0, 48405.27392089122, 48951.531454056436, 49550.0, 8704.782380440287, 8827.911720882967, 8858.689945851864, 8885.955570222366, 8913.910860891308, 36456.817715912315, 36858.44712329371, 36871.63128368682, 37190.44214336733, 37429.0, 45944.77027614974, 46410.30384544302, 46686.299705505124, 47500.524994750995, 47849.76075119602, 8416.074231834371, 8516.531590762568, 8566.229039386486, 8579.184977427134, 8641.913580864111, 12786.360681965678, 12799.872001279868, 12950.93524532409, 12995.350232488148, 13004.739905201654, 11250.549978000789, 11250.66248012561, 11253.88746112561, 11345.489452974802, 12131.21147125434, 11668.358240296526, 11906.345151016778, 12004.21972571815, 12361.07291953089, 12404.937975310066, 11411.486483108114, 11552.768944620891, 11580.30518168879, 11867.109966752356, 11939.880601193878, 10063.446510441703, 10147.289778892073, 10182.541785619516, 10261.333013354108, 10627.89372106269, 8994.640214391351, 9487.573059212215, 9785.461799600806, 9804.509774511389, 9863.556139973574]}, "summary": {"lowerIsBetter": false, "suite": 6785.4787231729515, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 6791.692653871912, "unit": "ms", "value": 6791.692653871912}, "dojo.html": {"lowerIsBetter": false, "filtered": 5521.308162161992, "unit": "ms", "value": 5521.308162161992}, "mootools.html": {"lowerIsBetter": false, "filtered": 4514.851836343627, "unit": "ms", "value": 4514.851836343627}, "ext.html": {"lowerIsBetter": false, "filtered": 18833.631706648815, "unit": "ms", "value": 18833.631706648815}, "prototype.html": {"lowerIsBetter": false, "filtered": 4854.43299255418, "unit": "ms", "value": 4854.43299255418}, "yui.html": {"lowerIsBetter": false, "filtered": 6305.3717271982405, "unit": "ms", "value": 6305.3717271982405}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04.e", "os": "linux", "name": "talos-linux64-ix-016.e"}, "testrun": {"date": 1447270639, "suite": "dromaeo_css", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151111101339", "branch": "Fx-Team", "revision": "8bf46ba0297dfecfdbae08edc1166d8a10bbadf8"}}, {"talos_counters": {}, "results": {"audio-dft": [160.0, 162.0, 163.0, 160.0, 166.0, 160.0, 161.0, 164.0, 172.0, 162.0], "ai-astar": [110.0, 103.0, 109.0, 111.0, 110.0, 121.0, 111.0, 111.0, 110.0, 111.0], "imaging-gaussian-blur": [110.0, 111.0, 111.0, 111.0, 111.0, 110.0, 110.0, 111.0, 110.0, 111.0], "audio-beat-detection": [156.0, 124.0, 150.0, 156.0, 126.0, 152.0, 151.0, 130.0, 168.0, 125.0], "json-stringify-tinderbox": [67.0, 68.0, 68.0, 67.0, 68.0, 69.0, 68.0, 68.0, 68.0, 68.0], "stanford-crypto-pbkdf2": [139.0, 152.0, 154.0, 143.0, 151.0, 139.0, 150.0, 153.0, 153.0, 138.0], "json-parse-financial": [61.0, 63.0, 62.0, 61.0, 61.0, 63.0, 62.0, 67.0, 61.0, 59.0], "stanford-crypto-sha256-iterative": [69.0, 74.0, 67.0, 69.0, 69.0, 68.0, 76.0, 65.0, 66.0, 67.0], "audio-fft": [72.0, 71.0, 71.0, 158.0, 71.0, 73.0, 71.0, 71.0, 160.0, 72.0], "imaging-darkroom": [146.0, 146.0, 146.0, 147.0, 148.0, 147.0, 145.0, 146.0, 145.0, 147.0], "stanford-crypto-ccm": [128.0, 132.0, 125.0, 131.0, 121.0, 125.0, 121.0, 128.0, 124.0, 120.0], "audio-oscillator": [90.0, 92.0, 138.0, 91.0, 93.0, 89.0, 145.0, 91.0, 91.0, 130.0], "stanford-crypto-aes": [91.0, 86.0, 86.0, 86.0, 85.0, 85.0, 85.0, 84.0, 85.0, 85.0], "imaging-desaturate": [96.0, 96.0, 96.0, 96.0, 96.0, 97.0, 96.0, 96.0, 96.0, 96.0]}, "summary": {"lowerIsBetter": true, "suite": 1521.9, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 89.0, "unit": "ms", "value": 89.0}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 147.2, "unit": "ms", "value": 147.2}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 143.8, "unit": "ms", "value": 143.8}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 125.5, "unit": "ms", "value": 125.5}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 146.3, "unit": "ms", "value": 146.3}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 62.0, "unit": "ms", "value": 62.0}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 105.0, "unit": "ms", "value": 105.0}, "ai-astar": {"lowerIsBetter": true, "filtered": 110.7, "unit": "ms", "value": 110.7}, "audio-dft": {"lowerIsBetter": true, "filtered": 163.0, "unit": "ms", "value": 163.0}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 69.0, "unit": "ms", "value": 69.0}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 67.9, "unit": "ms", "value": 67.9}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 110.6, "unit": "ms", "value": 110.6}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 85.8, "unit": "ms", "value": 85.8}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 96.1, "unit": "ms", "value": 96.1}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04.e", "os": "linux", "name": "talos-linux64-ix-016.e"}, "testrun": {"date": 1447270639, "suite": "kraken", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151111101339", "branch": "Fx-Team", "revision": "8bf46ba0297dfecfdbae08edc1166d8a10bbadf8"}}, {"talos_counters": {}, "results": {"DeltaBlue": [194.3634596695821], "Encrypt": [281.6901408450704], "NavierStokes": [4873.78640776699], "Decrypt": [5086.294416243655], "Splay": [611.2469437652812], "Richards": [162.44314489928524], "RegExp": [25075.0], "Earley": [713.7758743754462], "Boyer": [11697.67441860465], "RayTrace": [1062.6992561105208]}, "summary": {"lowerIsBetter": false, "suite": 21464.902959614894, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 340.1771100000001, "unit": "score", "value": 340.1771100000001}, "Encrypt": {"lowerIsBetter": false, "filtered": 944.9425500000004, "unit": "score", "value": 944.9425500000004}, "NavierStokes": {"lowerIsBetter": false, "filtered": 304.48605577689233, "unit": "score", "value": 304.48605577689233}, "Decrypt": {"lowerIsBetter": false, "filtered": 52.33299101796402, "unit": "score", "value": 52.33299101796402}, "Splay": {"lowerIsBetter": false, "filtered": 133.31927600000003, "unit": "score", "value": 133.31927600000003}, "RegExp": {"lowerIsBetter": false, "filtered": 36.33040877367896, "unit": "score", "value": 36.33040877367896}, "Richards": {"lowerIsBetter": false, "filtered": 217.31911199999996, "unit": "score", "value": 217.31911199999996}, "Earley": {"lowerIsBetter": false, "filtered": 933.7146630000002, "unit": "score", "value": 933.7146630000002}, "Boyer": {"lowerIsBetter": false, "filtered": 56.97397415506962, "unit": "score", "value": 56.97397415506962}, "RayTrace": {"lowerIsBetter": false, "filtered": 696.3296489999998, "unit": "score", "value": 696.3296489999998}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04.e", "os": "linux", "name": "talos-linux64-ix-016.e"}, "testrun": {"date": 1447270639, "suite": "v8_7", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151111101339", "branch": "Fx-Team", "revision": "8bf46ba0297dfecfdbae08edc1166d8a10bbadf8"}}] 11:57:29 INFO - RETURN: dromaeo_css: 6785.48 11:57:29 INFO - RETURN: kraken: 1521.90 11:57:29 INFO - RETURN: v8_7: 21464.90 11:57:29 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,43]]", "result": "21464.90"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,43]]", "result": "1521.90"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,43]]", "result": "6785.48"}}} 11:57:29 INFO - Return code: 0 11:57:29 INFO - # TBPL SUCCESS # 11:57:29 INFO - Running post-action listener: _resource_record_post_action 11:57:29 INFO - Running post-run listener: _resource_record_post_run 11:57:30 INFO - Total resource usage - Wall time: 1224s; CPU: 13.0%; Read bytes: 315392; Write bytes: 274276352; Read time: 300; Write time: 138172 11:57:30 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 471040; Read time: 0; Write time: 44 11:57:30 INFO - run-tests - Wall time: 1210s; CPU: 13.0%; Read bytes: 311296; Write bytes: 273805312; Read time: 288; Write time: 138128 11:57:30 INFO - Running post-run listener: _upload_blobber_files 11:57:30 INFO - Blob upload gear active. 11:57:30 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 11:57:30 INFO - Copying logs to upload dir... 11:57:30 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1257.168888 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2015-11-11 11:57:30.661428) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-11 11:57:30.665340) ========= 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=d6a7e047ef025f707024e163000001c3-1447268838.358401-188899012 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010011 build_url: 'https://queue.taskcluster.net/v1/task/0RB1Vo85SleLtIskLdOkpg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-11 11:57:30.716930) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 11:57:30.717327) ========= 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=d6a7e047ef025f707024e163000001c3-1447268838.358401-188899012 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004578 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 11:57:30.766843) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-11 11:57:30.767166) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-11 11:57:30.767454) ========= ========= Total master_lag: 0.22 =========