builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-006 starttime: 1454112550.36 results: success (0) buildid: 20160129133018 builduid: 4cafd10eb2f644309419d1dea160d790 revision: 08eddf3af53186d5408afa2a40d82eb6e7c243aa ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.364895) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.365334) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.365633) ========= 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=e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006463 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.398299) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.398622) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.416998) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.417364) ========= 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=e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004729 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.467001) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.467329) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.467743) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.468057) ========= 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=e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-29 16:09:10-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 42.9M=0s 2016-01-29 16:09:11 (42.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.173289 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.657473) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.657792) ========= 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=e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018775 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.717541) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:10.717891) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 08eddf3af53186d5408afa2a40d82eb6e7c243aa --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 08eddf3af53186d5408afa2a40d82eb6e7c243aa --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=e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-29 16:09:11,208 truncating revision to first 12 chars 2016-01-29 16:09:11,209 Setting DEBUG logging. 2016-01-29 16:09:11,209 attempt 1/10 2016-01-29 16:09:11,209 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/08eddf3af531?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-29 16:09:11,463 unpacking tar archive at: mozilla-central-08eddf3af531/testing/mozharness/ program finished with exit code 0 elapsedTime=0.541051 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:11.272100) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:11.272533) ========= echo 08eddf3af53186d5408afa2a40d82eb6e7c243aa in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'08eddf3af53186d5408afa2a40d82eb6e7c243aa'] 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=e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08eddf3af53186d5408afa2a40d82eb6e7c243aa program finished with exit code 0 elapsedTime=0.004650 script_repo_revision: '08eddf3af53186d5408afa2a40d82eb6e7c243aa' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:11.324853) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:11.325245) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-29 16:09:11.335536) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2016-01-29 16:09:11.335890) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 16:09:11 INFO - MultiFileLogger online at 20160129 16:09:11 in /builds/slave/test-pgo 16:09:11 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 16:09:11 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 16:09:11 INFO - {'append_to_log': False, 16:09:11 INFO - 'base_work_dir': '/builds/slave/test-pgo', 16:09:11 INFO - 'blob_upload_branch': 'Firefox', 16:09:11 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 16:09:11 INFO - 'branch': 'Firefox', 16:09:11 INFO - 'buildbot_json_path': 'buildprops.json', 16:09:11 INFO - 'config_files': ('talos/linux_config.py',), 16:09:11 INFO - 'default_actions': ('clobber', 16:09:11 INFO - 'read-buildbot-config', 16:09:11 INFO - 'download-and-extract', 16:09:11 INFO - 'populate-webroot', 16:09:11 INFO - 'create-virtualenv', 16:09:11 INFO - 'install', 16:09:11 INFO - 'run-tests'), 16:09:11 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:09:11 INFO - 'download_minidump_stackwalk': True, 16:09:11 INFO - 'download_symbols': 'ondemand', 16:09:11 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:09:11 INFO - 'tooltool.py': '/tools/tooltool.py', 16:09:11 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:09:11 INFO - '/tools/misc-python/virtualenv.py')}, 16:09:11 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:09:11 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:09:11 INFO - 'installer_path': 'installer.exe', 16:09:11 INFO - 'log_level': 'info', 16:09:11 INFO - 'log_name': 'talos', 16:09:11 INFO - 'log_to_console': True, 16:09:11 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 16:09:11 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 16:09:11 INFO - 'opt_config_files': (), 16:09:11 INFO - 'pip_index': False, 16:09:11 INFO - 'sps_profile': False, 16:09:11 INFO - 'sps_profile_interval': 0, 16:09:11 INFO - 'suite': 'dromaeojs-e10s', 16:09:11 INFO - 'system_bits': '32', 16:09:11 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:09:11 INFO - 'title': 'talos-linux64-ix-006', 16:09:11 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:09:11 INFO - 'use_talos_json': True, 16:09:11 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 16:09:11 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:09:11 INFO - 'work_dir': 'build'} 16:09:11 INFO - ##### 16:09:11 INFO - ##### Running clobber step. 16:09:11 INFO - ##### 16:09:11 INFO - Running pre-action listener: _resource_record_pre_action 16:09:11 INFO - Running main action method: clobber 16:09:11 INFO - rmtree: /builds/slave/test-pgo/build 16:09:11 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 16:09:12 INFO - Running post-action listener: _resource_record_post_action 16:09:12 INFO - ##### 16:09:12 INFO - ##### Running read-buildbot-config step. 16:09:12 INFO - ##### 16:09:12 INFO - Running pre-action listener: _resource_record_pre_action 16:09:12 INFO - Running main action method: read_buildbot_config 16:09:12 INFO - Using buildbot properties: 16:09:12 INFO - { 16:09:12 INFO - "project": "", 16:09:12 INFO - "product": "firefox", 16:09:12 INFO - "script_repo_revision": "production", 16:09:12 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 16:09:12 INFO - "repository": "", 16:09:12 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs-e10s", 16:09:12 INFO - "buildid": "20160129133018", 16:09:12 INFO - "pgo_build": "True", 16:09:12 INFO - "basedir": "/builds/slave/test-pgo", 16:09:12 INFO - "buildnumber": 89, 16:09:12 INFO - "slavename": "talos-linux64-ix-006", 16:09:12 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 16:09:12 INFO - "platform": "ubuntu64_hw", 16:09:12 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 16:09:12 INFO - "branch": "mozilla-central", 16:09:12 INFO - "repo_path": "mozilla-central", 16:09:12 INFO - "revision": "08eddf3af53186d5408afa2a40d82eb6e7c243aa", 16:09:12 INFO - "stage_platform": "linux64-pgo", 16:09:12 INFO - "builduid": "4cafd10eb2f644309419d1dea160d790", 16:09:12 INFO - "slavebuilddir": "test" 16:09:12 INFO - } 16:09:12 INFO - Found installer url https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 16:09:12 INFO - Running post-action listener: _resource_record_post_action 16:09:12 INFO - ##### 16:09:12 INFO - ##### Running download-and-extract step. 16:09:12 INFO - ##### 16:09:12 INFO - Running pre-action listener: _resource_record_pre_action 16:09:12 INFO - Running main action method: download_and_extract 16:09:12 INFO - mkdir: /builds/slave/test-pgo/build/tests 16:09:12 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')]} 16:09:12 INFO - https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 16:09:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/test_packages.json 16:09:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/test_packages.json 16:09:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 16:09:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 16:09:33 INFO - Downloaded 1448 bytes. 16:09:33 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 16:09:33 INFO - Using the following test package requirements: 16:09:33 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 16:09:33 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 16:09:33 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 16:09:33 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 16:09:33 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 16:09:33 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 16:09:33 INFO - u'jsshell-linux-x86_64.zip'], 16:09:33 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 16:09:33 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 16:09:33 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 16:09:33 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 16:09:33 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 16:09:33 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 16:09:33 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 16:09:33 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 16:09:33 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 16:09:33 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 16:09:33 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 16:09:33 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 16:09:33 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 16:09:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:09:33 INFO - https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 16:09:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 16:09:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 16:09:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 16:09:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 16:09:37 INFO - Downloaded 22543800 bytes. 16:09:37 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 16:09:37 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 16:09:38 INFO - Return code: 0 16:09:38 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 16:09:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:09:38 INFO - https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 16:09:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 16:09:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 16:09:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 16:09:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 16:09:41 INFO - Downloaded 22543800 bytes. 16:09:41 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 16:09:41 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 16:09:43 INFO - Return code: 0 16:09: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')]} 16:09:43 INFO - https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 16:09:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 16:09:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 16:09:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 16:09:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 16:09:47 INFO - Downloaded 10706582 bytes. 16:09:47 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 16:09:47 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 16:09:47 INFO - Return code: 0 16:09:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:09:47 INFO - https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 16:09:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 16:09:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 16:09:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 16:09:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 16:09:49 INFO - Downloaded 55993804 bytes. 16:09:49 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 16:09:49 INFO - mkdir: /builds/slave/test-pgo/properties 16:09:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 16:09:49 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 16:09:49 INFO - Contents: 16:09:49 INFO - build_url:https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 16:09:49 INFO - Running post-action listener: _resource_record_post_action 16:09:49 INFO - Running post-action listener: set_extra_try_arguments 16:09:49 INFO - ##### 16:09:49 INFO - ##### Running populate-webroot step. 16:09:49 INFO - ##### 16:09:49 INFO - Running pre-action listener: _resource_record_pre_action 16:09:49 INFO - Running main action method: populate_webroot 16:09:49 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:09:49 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:09:49 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:09:49 INFO - '--tppagecycles', 16:09:49 INFO - '7'], 16:09:49 INFO - 'tests': ['tsvgm']}}, 16:09:49 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 16:09:49 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 16:09:49 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:09:49 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 16:09:49 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 16:09:49 INFO - 'tests': ['dromaeo_css', 'kraken']}, 16:09:49 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:09:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:09:49 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:09:49 INFO - 'talos_options': ['--e10s'], 16:09:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:09:49 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:09:49 INFO - 'tests': ['damp', 'tps']}, 16:09:49 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:09:49 INFO - 'talos_options': ['--e10s'], 16:09:49 INFO - 'tests': ['damp', 'tps']}, 16:09:49 INFO - 'g3': {'tests': ['dromaeo_dom']}, 16:09:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:09:49 INFO - 'other': {'tests': ['a11yr', 16:09:49 INFO - 'ts_paint', 16:09:49 INFO - 'tpaint', 16:09:49 INFO - 'sessionrestore', 16:09:49 INFO - 'sessionrestore_no_auto_restore']}, 16:09:49 INFO - 'other-e10s': {'talos_options': ['--e10s'], 16:09:49 INFO - 'tests': ['a11yr', 16:09:49 INFO - 'ts_paint', 16:09:49 INFO - 'tpaint', 16:09:49 INFO - 'sessionrestore', 16:09:49 INFO - 'sessionrestore_no_auto_restore']}, 16:09:49 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 16:09:49 INFO - 'tests': ['a11yr', 16:09:49 INFO - 'ts_paint', 16:09:49 INFO - 'tpaint', 16:09:49 INFO - 'sessionrestore', 16:09:49 INFO - 'sessionrestore_no_auto_restore']}, 16:09:49 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 16:09:49 INFO - 'tests': ['a11yr', 16:09:49 INFO - 'ts_paint', 16:09:49 INFO - 'tpaint', 16:09:49 INFO - 'sessionrestore', 16:09:49 INFO - 'sessionrestore_no_auto_restore']}, 16:09:49 INFO - 'other_l64': {'tests': ['a11yr', 16:09:49 INFO - 'ts_paint', 16:09:49 INFO - 'tpaint', 16:09:49 INFO - 'sessionrestore', 16:09:49 INFO - 'sessionrestore_no_auto_restore']}, 16:09:49 INFO - 'other_nol64': {'tests': ['a11yr', 16:09:49 INFO - 'ts_paint', 16:09:49 INFO - 'tpaint', 16:09:49 INFO - 'sessionrestore', 16:09:49 INFO - 'sessionrestore_no_auto_restore']}, 16:09:49 INFO - 'svgr': {'tests': ['tsvgx', 16:09:49 INFO - 'tsvgr_opacity', 16:09:49 INFO - 'tart', 16:09:49 INFO - 'tscrollx', 16:09:49 INFO - 'cart']}, 16:09:49 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 16:09:49 INFO - 'tests': ['tsvgx', 16:09:49 INFO - 'tsvgr_opacity', 16:09:49 INFO - 'tart', 16:09:49 INFO - 'tscrollx', 16:09:49 INFO - 'cart']}, 16:09:49 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:09:49 INFO - 'tests': ['tp5o']}, 16:09:49 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:09:49 INFO - 'talos_options': ['--e10s'], 16:09:49 INFO - 'tests': ['tp5o']}, 16:09:49 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:09:49 INFO - 'talos_options': ['--xperf_path', 16:09:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:09:49 INFO - 'tests': ['tp5n']}, 16:09:49 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:09:49 INFO - 'talos_options': ['--e10s', 16:09:49 INFO - '--xperf_path', 16:09:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:09:49 INFO - 'tests': ['tp5n']}}, 16:09:49 INFO - 'talos.zip': {'path': '', 16:09:49 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:09:49 INFO - Running post-action listener: _resource_record_post_action 16:09:49 INFO - ##### 16:09:49 INFO - ##### Running create-virtualenv step. 16:09:49 INFO - ##### 16:09:49 INFO - Running pre-action listener: _resource_record_pre_action 16:09:49 INFO - Running main action method: create_virtualenv 16:09:49 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 16:09:49 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 16:09:49 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 16:09:50 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:09:50 INFO - Using real prefix '/usr' 16:09:50 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 16:09:50 INFO - Installing distribute.............................................................................................................................................................................................done. 16:09:52 INFO - Installing pip.................done. 16:09:52 INFO - Return code: 0 16:09:52 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 16:09:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:09:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:09:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:09:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:09:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:09:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:09:52 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f1f91739f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11ca8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x129a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x132b840>, '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 0x12986b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1298b60>, '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': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', '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 16:09:52 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 16:09:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 16:09:52 INFO - Using env: {'DISPLAY': ':0', 16:09:52 INFO - 'HOME': '/home/cltbld', 16:09:52 INFO - 'LANG': 'en_US.UTF-8', 16:09:52 INFO - 'LANGUAGE': 'en_US:en', 16:09:52 INFO - 'LOGNAME': 'cltbld', 16:09:52 INFO - 'MAIL': '/var/mail/cltbld', 16:09:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:09:52 INFO - 'MOZ_NO_REMOTE': '1', 16:09:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:09:52 INFO - 'NO_EM_RESTART': '1', 16:09:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:09:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 16:09:52 INFO - 'PWD': '/builds/slave/test-pgo', 16:09:52 INFO - 'SHELL': '/bin/bash', 16:09:52 INFO - 'SHLVL': '1', 16:09:52 INFO - 'TERM': 'linux', 16:09:52 INFO - 'TMOUT': '86400', 16:09:52 INFO - 'USER': 'cltbld', 16:09:52 INFO - 'XDG_SESSION_COOKIE': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', 16:09:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:09:52 INFO - '_': '/tools/buildbot/bin/python'} 16:09:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:09:52 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 16:09:52 INFO - Cleaning up... 16:09:52 INFO - Return code: 0 16:09:52 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 16:09:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:09:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:09:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:09:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:09:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:09:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:09:52 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f1f91739f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11ca8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x129a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x132b840>, '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 0x12986b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1298b60>, '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': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', '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 16:09:52 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 16:09:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 16:09:52 INFO - Using env: {'DISPLAY': ':0', 16:09:52 INFO - 'HOME': '/home/cltbld', 16:09:52 INFO - 'LANG': 'en_US.UTF-8', 16:09:52 INFO - 'LANGUAGE': 'en_US:en', 16:09:52 INFO - 'LOGNAME': 'cltbld', 16:09:52 INFO - 'MAIL': '/var/mail/cltbld', 16:09:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:09:52 INFO - 'MOZ_NO_REMOTE': '1', 16:09:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:09:52 INFO - 'NO_EM_RESTART': '1', 16:09:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:09:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 16:09:52 INFO - 'PWD': '/builds/slave/test-pgo', 16:09:52 INFO - 'SHELL': '/bin/bash', 16:09:52 INFO - 'SHLVL': '1', 16:09:52 INFO - 'TERM': 'linux', 16:09:52 INFO - 'TMOUT': '86400', 16:09:52 INFO - 'USER': 'cltbld', 16:09:52 INFO - 'XDG_SESSION_COOKIE': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', 16:09:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:09:52 INFO - '_': '/tools/buildbot/bin/python'} 16:09:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:09:52 INFO - Downloading/unpacking psutil>=0.7.1 16:09: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 16:09: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 16:09: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 16:09: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 16:09: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 16:09: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 16:09:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 16:09:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:09:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:09:54 INFO - Installing collected packages: psutil 16:09:54 INFO - Running setup.py install for psutil 16:09:54 INFO - building 'psutil._psutil_linux' extension 16:09:54 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 16:09:55 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 16:09:55 INFO - building 'psutil._psutil_posix' extension 16:09:55 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 16:09:55 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 16:09:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:09:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:09:55 INFO - Successfully installed psutil 16:09:55 INFO - Cleaning up... 16:09:55 INFO - Return code: 0 16:09:55 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 16:09:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:09:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:09:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:09:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:09:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:09:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:09:55 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f1f91739f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11ca8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x129a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x132b840>, '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 0x12986b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1298b60>, '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': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', '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 16:09:55 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 16:09:55 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 16:09:55 INFO - Using env: {'DISPLAY': ':0', 16:09:55 INFO - 'HOME': '/home/cltbld', 16:09:55 INFO - 'LANG': 'en_US.UTF-8', 16:09:55 INFO - 'LANGUAGE': 'en_US:en', 16:09:55 INFO - 'LOGNAME': 'cltbld', 16:09:55 INFO - 'MAIL': '/var/mail/cltbld', 16:09:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:09:55 INFO - 'MOZ_NO_REMOTE': '1', 16:09:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:09:55 INFO - 'NO_EM_RESTART': '1', 16:09:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:09:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 16:09:55 INFO - 'PWD': '/builds/slave/test-pgo', 16:09:55 INFO - 'SHELL': '/bin/bash', 16:09:55 INFO - 'SHLVL': '1', 16:09:55 INFO - 'TERM': 'linux', 16:09:55 INFO - 'TMOUT': '86400', 16:09:55 INFO - 'USER': 'cltbld', 16:09:55 INFO - 'XDG_SESSION_COOKIE': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', 16:09:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:09:55 INFO - '_': '/tools/buildbot/bin/python'} 16:09:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:09:55 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 16:09: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 16:09: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 16:09: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 16:09: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 16:09: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 16:09: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 16:09:57 INFO - Downloading mozsystemmonitor-0.0.tar.gz 16:09:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:09:57 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 16:09:57 INFO - Installing collected packages: mozsystemmonitor 16:09:57 INFO - Running setup.py install for mozsystemmonitor 16:09:57 INFO - Successfully installed mozsystemmonitor 16:09:57 INFO - Cleaning up... 16:09:57 INFO - Return code: 0 16:09:57 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 16:09: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')]} 16:09:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:09:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:09: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')]} 16:09:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:09:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:09:57 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f1f91739f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11ca8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x129a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x132b840>, '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 0x12986b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1298b60>, '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': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', '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 16:09:57 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 16:09:57 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 16:09:57 INFO - Using env: {'DISPLAY': ':0', 16:09:57 INFO - 'HOME': '/home/cltbld', 16:09:57 INFO - 'LANG': 'en_US.UTF-8', 16:09:57 INFO - 'LANGUAGE': 'en_US:en', 16:09:57 INFO - 'LOGNAME': 'cltbld', 16:09:57 INFO - 'MAIL': '/var/mail/cltbld', 16:09:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:09:57 INFO - 'MOZ_NO_REMOTE': '1', 16:09:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:09:57 INFO - 'NO_EM_RESTART': '1', 16:09:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:09:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 16:09:57 INFO - 'PWD': '/builds/slave/test-pgo', 16:09:57 INFO - 'SHELL': '/bin/bash', 16:09:57 INFO - 'SHLVL': '1', 16:09:57 INFO - 'TERM': 'linux', 16:09:57 INFO - 'TMOUT': '86400', 16:09:57 INFO - 'USER': 'cltbld', 16:09:57 INFO - 'XDG_SESSION_COOKIE': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', 16:09:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:09:57 INFO - '_': '/tools/buildbot/bin/python'} 16:09:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:09:57 INFO - Downloading/unpacking blobuploader==1.2.4 16:09:57 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 16:09:57 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 16:09:57 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 16:09:57 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 16:09:57 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 16:09:57 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 16:09:59 INFO - Downloading blobuploader-1.2.4.tar.gz 16:09:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:09:59 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:09:59 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 16:09:59 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 16:09:59 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 16:09:59 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 16:09:59 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 16:09:59 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 16:09:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 16:09:59 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:09:59 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 16:09:59 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 16:09:59 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 16:09:59 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 16:09:59 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 16:09:59 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 16:10:00 INFO - Downloading docopt-0.6.1.tar.gz 16:10:00 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 16:10:00 INFO - Installing collected packages: blobuploader, requests, docopt 16:10:00 INFO - Running setup.py install for blobuploader 16:10:00 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:10:00 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 16:10:00 INFO - Running setup.py install for requests 16:10:00 INFO - Running setup.py install for docopt 16:10:00 INFO - Successfully installed blobuploader requests docopt 16:10:00 INFO - Cleaning up... 16:10:00 INFO - Return code: 0 16:10:00 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 16:10: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')]} 16:10:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:10:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:10: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')]} 16:10:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:10:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:10:00 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f1f91739f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11ca8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x129a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x132b840>, '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 0x12986b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1298b60>, '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': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', '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 16:10:00 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 16:10:00 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:10:00 INFO - Using env: {'DISPLAY': ':0', 16:10:00 INFO - 'HOME': '/home/cltbld', 16:10:00 INFO - 'LANG': 'en_US.UTF-8', 16:10:00 INFO - 'LANGUAGE': 'en_US:en', 16:10:00 INFO - 'LOGNAME': 'cltbld', 16:10:00 INFO - 'MAIL': '/var/mail/cltbld', 16:10:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:10:00 INFO - 'MOZ_NO_REMOTE': '1', 16:10:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:10:00 INFO - 'NO_EM_RESTART': '1', 16:10:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:10:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 16:10:00 INFO - 'PWD': '/builds/slave/test-pgo', 16:10:00 INFO - 'SHELL': '/bin/bash', 16:10:00 INFO - 'SHLVL': '1', 16:10:00 INFO - 'TERM': 'linux', 16:10:00 INFO - 'TMOUT': '86400', 16:10:00 INFO - 'USER': 'cltbld', 16:10:00 INFO - 'XDG_SESSION_COOKIE': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', 16:10:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:10:00 INFO - '_': '/tools/buildbot/bin/python'} 16:10:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 16:10:01 INFO - Running setup.py (path:/tmp/pip-AWUiva-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 16:10:01 INFO - Running setup.py (path:/tmp/pip-xfOGe2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 16:10:01 INFO - Running setup.py (path:/tmp/pip-MlJbwH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 16:10:01 INFO - Running setup.py (path:/tmp/pip-752hSJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 16:10:01 INFO - Running setup.py (path:/tmp/pip-E_wyRx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 16:10:01 INFO - Running setup.py (path:/tmp/pip-Jl1vcU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 16:10:01 INFO - Running setup.py (path:/tmp/pip-Y98FEV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 16:10:01 INFO - Running setup.py (path:/tmp/pip-51Fcko-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 16:10:01 INFO - Running setup.py (path:/tmp/pip-75_22O-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 16:10:01 INFO - Running setup.py (path:/tmp/pip-4P3Bhc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 16:10:01 INFO - Running setup.py (path:/tmp/pip-v2VbOC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 16:10:01 INFO - Running setup.py (path:/tmp/pip-iNR0vO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 16:10:01 INFO - Running setup.py (path:/tmp/pip-UwICpA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 16:10:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 16:10:01 INFO - Running setup.py (path:/tmp/pip-oDUL0k-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 16:10:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 16:10:02 INFO - Running setup.py (path:/tmp/pip-uXa5hn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 16:10:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 16:10:02 INFO - Running setup.py (path:/tmp/pip-h315GV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 16:10:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 16:10:02 INFO - Running setup.py (path:/tmp/pip-qknA3s-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 16:10:02 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:10:02 INFO - Running setup.py install for manifestparser 16:10:02 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 16:10:02 INFO - Running setup.py install for mozcrash 16:10:02 INFO - Running setup.py install for mozdebug 16:10:02 INFO - Running setup.py install for mozdevice 16:10:02 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 16:10:02 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 16:10:02 INFO - Running setup.py install for mozfile 16:10:02 INFO - Running setup.py install for mozhttpd 16:10:02 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 16:10:02 INFO - Running setup.py install for mozinfo 16:10:02 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 16:10:02 INFO - Running setup.py install for mozInstall 16:10:03 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 16:10:03 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 16:10:03 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 16:10:03 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 16:10:03 INFO - Running setup.py install for mozleak 16:10:03 INFO - Running setup.py install for mozlog 16:10:03 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 16:10:03 INFO - Running setup.py install for moznetwork 16:10:03 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 16:10:03 INFO - Running setup.py install for mozprocess 16:10:03 INFO - Running setup.py install for mozprofile 16:10:03 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 16:10:03 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 16:10:03 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 16:10:03 INFO - Running setup.py install for mozrunner 16:10:03 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 16:10:03 INFO - Running setup.py install for mozscreenshot 16:10:03 INFO - Running setup.py install for moztest 16:10:03 INFO - Running setup.py install for mozversion 16:10:03 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 16:10:04 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:10:04 INFO - Cleaning up... 16:10:04 INFO - Return code: 0 16:10:04 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 16:10: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')]} 16:10:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:10:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:10: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')]} 16:10:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:10:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:10:04 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f1f91739f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11ca8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x129a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x132b840>, '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 0x12986b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1298b60>, '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': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', '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 16:10:04 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 16:10:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:10:04 INFO - Using env: {'DISPLAY': ':0', 16:10:04 INFO - 'HOME': '/home/cltbld', 16:10:04 INFO - 'LANG': 'en_US.UTF-8', 16:10:04 INFO - 'LANGUAGE': 'en_US:en', 16:10:04 INFO - 'LOGNAME': 'cltbld', 16:10:04 INFO - 'MAIL': '/var/mail/cltbld', 16:10:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:10:04 INFO - 'MOZ_NO_REMOTE': '1', 16:10:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:10:04 INFO - 'NO_EM_RESTART': '1', 16:10:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:10:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 16:10:04 INFO - 'PWD': '/builds/slave/test-pgo', 16:10:04 INFO - 'SHELL': '/bin/bash', 16:10:04 INFO - 'SHLVL': '1', 16:10:04 INFO - 'TERM': 'linux', 16:10:04 INFO - 'TMOUT': '86400', 16:10:04 INFO - 'USER': 'cltbld', 16:10:04 INFO - 'XDG_SESSION_COOKIE': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', 16:10:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:10:04 INFO - '_': '/tools/buildbot/bin/python'} 16:10:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:10:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 16:10:04 INFO - Running setup.py (path:/tmp/pip-PVTSXg-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 16:10:04 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 16:10:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 16:10:04 INFO - Running setup.py (path:/tmp/pip-1OTyyw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 16:10:04 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)) 16:10:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 16:10:04 INFO - Running setup.py (path:/tmp/pip-X7UICr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 16:10:04 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)) 16:10:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 16:10:04 INFO - Running setup.py (path:/tmp/pip-MK8M_y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 16:10:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 16:10:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 16:10:04 INFO - Running setup.py (path:/tmp/pip-BowzsT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 16:10:04 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)) 16:10:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 16:10:04 INFO - Running setup.py (path:/tmp/pip-373PMI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 16:10:04 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)) 16:10:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 16:10:04 INFO - Running setup.py (path:/tmp/pip-x5rcWq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 16:10:04 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)) 16:10:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 16:10:04 INFO - Running setup.py (path:/tmp/pip-v4GlJd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 16:10:04 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)) 16:10:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 16:10:04 INFO - Running setup.py (path:/tmp/pip-tzrB3O-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 16:10:04 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)) 16:10:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 16:10:04 INFO - Running setup.py (path:/tmp/pip-LYPMOM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 16:10:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 16:10:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 16:10:04 INFO - Running setup.py (path:/tmp/pip-4toj_o-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 16:10:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 16:10:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 16:10:05 INFO - Running setup.py (path:/tmp/pip-o8BwrN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 16:10:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 16:10:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 16:10:05 INFO - Running setup.py (path:/tmp/pip-_ZicIW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 16:10:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13)) 16:10:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 16:10:05 INFO - Running setup.py (path:/tmp/pip-6wZ2i6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 16:10:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 16:10:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 16:10:05 INFO - Running setup.py (path:/tmp/pip-pKeyhy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 16:10:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 16:10:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 16:10:05 INFO - Running setup.py (path:/tmp/pip-LlnflU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 16:10:05 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)) 16:10:05 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 16:10:05 INFO - Running setup.py (path:/tmp/pip-YTvNMT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 16:10:05 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)) 16:10:05 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)) 16:10:05 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)) 16:10:05 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)) 16:10:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 16:10:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 16:10:05 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 16:10:05 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 16:10:05 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 16:10:05 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 16:10:05 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 16:10:05 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 16:10:05 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 16:10:07 INFO - Downloading blessings-1.6.tar.gz 16:10:07 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 16:10:07 INFO - Installing collected packages: blessings 16:10:07 INFO - Running setup.py install for blessings 16:10:07 INFO - Successfully installed blessings 16:10:07 INFO - Cleaning up... 16:10:07 INFO - Return code: 0 16:10:07 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 16:10:07 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 16:10:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 16:10:07 INFO - Reading from file tmpfile_stdout 16:10:07 INFO - Current package versions: 16:10:07 INFO - argparse == 1.2.1 16:10:07 INFO - blessings == 1.6 16:10:07 INFO - blobuploader == 1.2.4 16:10:07 INFO - docopt == 0.6.1 16:10:07 INFO - manifestparser == 1.1 16:10:07 INFO - mozInstall == 1.12 16:10:07 INFO - mozcrash == 0.16 16:10:07 INFO - mozdebug == 0.1 16:10:07 INFO - mozdevice == 0.48 16:10:07 INFO - mozfile == 1.2 16:10:07 INFO - mozhttpd == 0.7 16:10:07 INFO - mozinfo == 0.9 16:10:07 INFO - mozleak == 0.1 16:10:07 INFO - mozlog == 3.1 16:10:07 INFO - moznetwork == 0.27 16:10:07 INFO - mozprocess == 0.22 16:10:07 INFO - mozprofile == 0.28 16:10:07 INFO - mozrunner == 6.11 16:10:07 INFO - mozscreenshot == 0.1 16:10:07 INFO - mozsystemmonitor == 0.0 16:10:07 INFO - moztest == 0.7 16:10:07 INFO - mozversion == 1.4 16:10:07 INFO - psutil == 3.1.1 16:10:07 INFO - requests == 1.2.3 16:10:07 INFO - wsgiref == 0.1.2 16:10:07 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 16:10:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:10:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:10:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:10:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:10:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:10:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:10:07 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f1f91739f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11ca8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x129a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x132b840>, '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 0x12986b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1298b60>, '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': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', '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 16:10:07 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/talos 16:10:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:10:07 INFO - Using env: {'DISPLAY': ':0', 16:10:07 INFO - 'HOME': '/home/cltbld', 16:10:07 INFO - 'LANG': 'en_US.UTF-8', 16:10:07 INFO - 'LANGUAGE': 'en_US:en', 16:10:07 INFO - 'LOGNAME': 'cltbld', 16:10:07 INFO - 'MAIL': '/var/mail/cltbld', 16:10:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:10:07 INFO - 'MOZ_NO_REMOTE': '1', 16:10:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:10:07 INFO - 'NO_EM_RESTART': '1', 16:10:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:10:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 16:10:07 INFO - 'PWD': '/builds/slave/test-pgo', 16:10:07 INFO - 'SHELL': '/bin/bash', 16:10:07 INFO - 'SHLVL': '1', 16:10:07 INFO - 'TERM': 'linux', 16:10:07 INFO - 'TMOUT': '86400', 16:10:07 INFO - 'USER': 'cltbld', 16:10:07 INFO - 'XDG_SESSION_COOKIE': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', 16:10:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:10:07 INFO - '_': '/tools/buildbot/bin/python'} 16:10:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:10:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 16:10:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2)) 16:10:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 16:10:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 16:10:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5)) 16:10:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6)) 16:10:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7)) 16:10:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8)) 16:10:07 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 9)) 16:10:07 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 16:10:07 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 16:10:07 INFO - Cleaning up... 16:10:07 INFO - Return code: 0 16:10:07 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 16:10:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:10:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:10:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:10:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:10:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:10:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:10:07 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f1f91739f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11ca8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x129a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x132b840>, '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 0x12986b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1298b60>, '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': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', '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 16:10:07 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test-pgo/build 16:10:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 16:10:07 INFO - Using env: {'DISPLAY': ':0', 16:10:07 INFO - 'HOME': '/home/cltbld', 16:10:07 INFO - 'LANG': 'en_US.UTF-8', 16:10:07 INFO - 'LANGUAGE': 'en_US:en', 16:10:07 INFO - 'LOGNAME': 'cltbld', 16:10:07 INFO - 'MAIL': '/var/mail/cltbld', 16:10:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:10:07 INFO - 'MOZ_NO_REMOTE': '1', 16:10:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:10:07 INFO - 'NO_EM_RESTART': '1', 16:10:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:10:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 16:10:07 INFO - 'PWD': '/builds/slave/test-pgo', 16:10:07 INFO - 'SHELL': '/bin/bash', 16:10:07 INFO - 'SHLVL': '1', 16:10:07 INFO - 'TERM': 'linux', 16:10:07 INFO - 'TMOUT': '86400', 16:10:07 INFO - 'USER': 'cltbld', 16:10:07 INFO - 'XDG_SESSION_COOKIE': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', 16:10:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:10:07 INFO - '_': '/tools/buildbot/bin/python'} 16:10:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:10:08 INFO - Downloading/unpacking jsonschema 16:10:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:10:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:10:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:10:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:10:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:10:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:10:09 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:10:09 INFO - Downloading/unpacking functools32 (from jsonschema) 16:10:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:10:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:10:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:10:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:10:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:10:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:10:10 INFO - Downloading functools32-3.2.3-2.tar.gz 16:10:10 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 16:10:10 INFO - warning: no files found matching '*.txt' 16:10:10 INFO - no previously-included directories found matching 'build' 16:10:10 INFO - no previously-included directories found matching 'dist' 16:10:10 INFO - no previously-included directories found matching '.git*' 16:10:10 INFO - Installing collected packages: jsonschema, functools32 16:10:10 INFO - Running setup.py install for functools32 16:10:10 INFO - warning: no files found matching '*.txt' 16:10:10 INFO - no previously-included directories found matching 'build' 16:10:10 INFO - no previously-included directories found matching 'dist' 16:10:10 INFO - no previously-included directories found matching '.git*' 16:10:10 INFO - Successfully installed jsonschema functools32 16:10:10 INFO - Cleaning up... 16:10:10 INFO - Return code: 0 16:10:10 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 16:10:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:10:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:10:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:10:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:10:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:10:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:10:10 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f1f91739f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11ca8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x129a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x132b840>, '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 0x12986b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1298b60>, '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': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', '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 16:10:10 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test-pgo/build 16:10:10 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 16:10:10 INFO - Using env: {'DISPLAY': ':0', 16:10:10 INFO - 'HOME': '/home/cltbld', 16:10:10 INFO - 'LANG': 'en_US.UTF-8', 16:10:10 INFO - 'LANGUAGE': 'en_US:en', 16:10:10 INFO - 'LOGNAME': 'cltbld', 16:10:10 INFO - 'MAIL': '/var/mail/cltbld', 16:10:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:10:10 INFO - 'MOZ_NO_REMOTE': '1', 16:10:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:10:10 INFO - 'NO_EM_RESTART': '1', 16:10:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:10:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 16:10:10 INFO - 'PWD': '/builds/slave/test-pgo', 16:10:10 INFO - 'SHELL': '/bin/bash', 16:10:10 INFO - 'SHLVL': '1', 16:10:10 INFO - 'TERM': 'linux', 16:10:10 INFO - 'TMOUT': '86400', 16:10:10 INFO - 'USER': 'cltbld', 16:10:10 INFO - 'XDG_SESSION_COOKIE': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', 16:10:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:10:10 INFO - '_': '/tools/buildbot/bin/python'} 16:10:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:10:10 INFO - Downloading/unpacking flake8 16:10:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:10:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:10:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:10:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:10:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:10:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:10:12 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 16:10:12 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 16:10:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:10:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:10:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:10:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:10:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:10:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:10:12 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 16:10:12 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 16:10:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:10:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:10:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:10:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:10:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:10:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:10:12 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 16:10:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:10:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:10:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:10:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:10:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:10:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:10:12 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 16:10:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 16:10:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 16:10:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 16:10:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 16:10:12 INFO - no previously-included directories found matching 'docs/_build' 16:10:12 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 16:10:13 INFO - Running setup.py install for pep8 16:10:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 16:10:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 16:10:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 16:10:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 16:10:13 INFO - no previously-included directories found matching 'docs/_build' 16:10:13 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 16:10:13 INFO - Successfully installed flake8 mccabe pyflakes pep8 16:10:13 INFO - Cleaning up... 16:10:13 INFO - Return code: 0 16:10:13 INFO - Running post-action listener: _resource_record_post_action 16:10:13 INFO - Running post-action listener: _start_resource_monitoring 16:10:13 INFO - Starting resource monitoring. 16:10:13 INFO - ##### 16:10:13 INFO - ##### Running install step. 16:10:13 INFO - ##### 16:10:13 INFO - Running pre-action listener: _resource_record_pre_action 16:10:13 INFO - Running main action method: install 16:10:13 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 16:10:13 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 16:10:13 INFO - Reading from file tmpfile_stdout 16:10:13 INFO - Detecting whether we're running mozinstall >=1.0... 16:10:13 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 16:10:13 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 16:10:13 INFO - Reading from file tmpfile_stdout 16:10:13 INFO - Output received: 16:10:13 INFO - Usage: mozinstall [options] installer 16:10:13 INFO - Options: 16:10:13 INFO - -h, --help show this help message and exit 16:10:13 INFO - -d DEST, --destination=DEST 16:10:13 INFO - Directory to install application into. [default: 16:10:13 INFO - "/builds/slave/test-pgo"] 16:10:13 INFO - --app=APP Application being installed. [default: firefox] 16:10:13 INFO - mkdir: /builds/slave/test-pgo/build/application 16:10:13 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 16:10:13 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 16:10:29 INFO - Reading from file tmpfile_stdout 16:10:29 INFO - Output received: 16:10:29 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 16:10:29 INFO - Running post-action listener: _resource_record_post_action 16:10:29 INFO - ##### 16:10:29 INFO - ##### Running run-tests step. 16:10:29 INFO - ##### 16:10:29 INFO - Running pre-action listener: _resource_record_pre_action 16:10:29 INFO - Running main action method: run_tests 16:10:29 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 16:10:29 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 16:10:29 INFO - Python 2.7.3 16:10:29 INFO - Return code: 0 16:10:29 INFO - grabbing minidump binary from tooltool 16:10:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:10:29 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 0x132b840>, '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 0x12986b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1298b60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 16:10:29 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 16:10:29 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 16:10:29 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:10:29 INFO - Return code: 0 16:10:29 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 16:10:29 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 16:10:29 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 16:10:29 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 16:10:29 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 16:10:29 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 16:10:29 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 16:10:30 INFO - Return code: 0 16:10:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-006', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test-pgo/build 16:10:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-006 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log 16:10:30 INFO - Using env: {'DISPLAY': ':0', 16:10:30 INFO - 'HOME': '/home/cltbld', 16:10:30 INFO - 'LANG': 'en_US.UTF-8', 16:10:30 INFO - 'LANGUAGE': 'en_US:en', 16:10:30 INFO - 'LOGNAME': 'cltbld', 16:10:30 INFO - 'MAIL': '/var/mail/cltbld', 16:10:30 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 16:10:30 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 16:10:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:10:30 INFO - 'MOZ_NO_REMOTE': '1', 16:10:30 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 16:10:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:10:30 INFO - 'NO_EM_RESTART': '1', 16:10:30 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:10:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 16:10:30 INFO - 'PWD': '/builds/slave/test-pgo', 16:10:30 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 16:10:30 INFO - 'SHELL': '/bin/bash', 16:10:30 INFO - 'SHLVL': '1', 16:10:30 INFO - 'TERM': 'linux', 16:10:30 INFO - 'TMOUT': '86400', 16:10:30 INFO - 'USER': 'cltbld', 16:10:30 INFO - 'XDG_SESSION_COOKIE': 'e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186', 16:10:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:10:30 INFO - '_': '/tools/buildbot/bin/python'} 16:10:30 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-006', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 16:10:30 INFO - mozversion application_buildid: 20160129133018 16:10:30 INFO - mozversion application_changeset: 08eddf3af53186d5408afa2a40d82eb6e7c243aa 16:10:30 INFO - mozversion application_display_name: Nightly 16:10:30 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:10:30 INFO - mozversion application_name: Firefox 16:10:30 INFO - mozversion application_remotingname: firefox 16:10:30 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 16:10:30 INFO - mozversion application_vendor: Mozilla 16:10:30 INFO - mozversion application_version: 47.0a1 16:10:30 INFO - mozversion platform_buildid: 20160129133018 16:10:30 INFO - mozversion platform_changeset: 08eddf3af53186d5408afa2a40d82eb6e7c243aa 16:10:30 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 16:10:30 INFO - mozversion platform_version: 47.0a1 16:10:30 INFO - using testdate: 1454112630 16:10:30 INFO - actual date: 1454112630 16:10:30 INFO - starting webserver on 'localhost:58738' 16:10:30 INFO - SUITE-START | Running 2 tests 16:10:30 INFO - TEST-START | dromaeo_css 16:10:30 INFO - operating with platform_type : linux_ 16:10:30 INFO - Initialising browser for dromaeo_css test... 16:10:31 INFO - TEST-INFO | started process 14499 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp1tuc8D/profile http://localhost:58738/getInfo.html) 16:10:34 INFO - PROCESS | 14499 | 16:10:34 INFO - PROCESS | 14499 | (process:14581): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:10:35 INFO - PROCESS | 14499 | __metrics Screen width/height:1600/1200 16:10:35 INFO - PROCESS | 14499 | colorDepth:24 16:10:35 INFO - PROCESS | 14499 | Browser inner width/height: 1024/697 16:10:35 INFO - PROCESS | 14499 | __metrics 16:10:35 INFO - PROCESS | 14499 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 16:10:36 INFO - TEST-INFO | 14499: exit 0 16:10:36 INFO - Browser initialized. 16:10:36 INFO - Running cycle 1/1 for dromaeo_css test... 16:10:36 INFO - TEST-INFO | started process 14630 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp1tuc8D/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:10:37 INFO - PROCESS | 14630 | 16:10:37 INFO - PROCESS | 14630 | (process:14690): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:10:48 INFO - PROCESS | 14630 | RSS: Main: 151072768 16:10:48 INFO - PROCESS | 14630 | 16:11:37 INFO - PROCESS | 14630 | 1454112697847 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] 16:13:46 INFO - PROCESS | 14630 | Cycle 1(1): loaded http://localhost:58738/tests/dromaeo/cssquery-dojo.html (next: http://localhost:58738/tests/dromaeo/cssquery-ext.html) 16:13:47 INFO - PROCESS | 14630 | RSS: Main: 161435648 16:13:47 INFO - PROCESS | 14630 | 16:16:49 INFO - PROCESS | 14630 | Cycle 1(1): loaded http://localhost:58738/tests/dromaeo/cssquery-ext.html (next: http://localhost:58738/tests/dromaeo/cssquery-jquery.html) 16:16:50 INFO - PROCESS | 14630 | RSS: Main: 155791360 16:16:50 INFO - PROCESS | 14630 | 16:19:51 INFO - PROCESS | 14630 | Cycle 1(1): loaded http://localhost:58738/tests/dromaeo/cssquery-jquery.html (next: http://localhost:58738/tests/dromaeo/cssquery-mootools.html) 16:19:52 INFO - PROCESS | 14630 | RSS: Main: 157261824 16:19:52 INFO - PROCESS | 14630 | 16:22:54 INFO - PROCESS | 14630 | Cycle 1(1): loaded http://localhost:58738/tests/dromaeo/cssquery-mootools.html (next: http://localhost:58738/tests/dromaeo/cssquery-prototype.html) 16:22:54 INFO - PROCESS | 14630 | RSS: Main: 155066368 16:22:54 INFO - PROCESS | 14630 | 16:25:57 INFO - PROCESS | 14630 | Cycle 1(1): loaded http://localhost:58738/tests/dromaeo/cssquery-prototype.html (next: http://localhost:58738/tests/dromaeo/cssquery-yui.html) 16:25:57 INFO - PROCESS | 14630 | RSS: Main: 155095040 16:25:57 INFO - PROCESS | 14630 | 16:28:59 INFO - PROCESS | 14630 | Cycle 1(1): loaded http://localhost:58738/tests/dromaeo/cssquery-yui.html (next: http://localhost:58738/tests/dromaeo/cssquery-dojo.html) 16:29:00 INFO - PROCESS | 14630 | RSS: Main: 158842880 16:29:00 INFO - PROCESS | 14630 | 16:29:00 INFO - PROCESS | 14630 | __start_tp_report 16:29:00 INFO - PROCESS | 14630 | _x_x_mozilla_page_load 16:29:00 INFO - PROCESS | 14630 | _x_x_mozilla_page_load_details 16:29:00 INFO - PROCESS | 14630 | |i|pagename|runs| 16:29:00 INFO - PROCESS | 14630 | |0;dojo.html;3201.7278531324837;3219.9356012879744;3244.0267919624107;3261.3640340133675;3271.6237632672237;5177.896442071156;5254.211868219764;5278.498542638443;5317.521423071923;5317.5214230719275;5181.041507321139;5183.766730497127;5255.264263003182;5264.42091369949;5330.413654498002;4795.808167673289;4800.447948485934;4824.035192961404;4856.68431551948;4943.6539442239055;4554.180247555439;4868.221084626461;4873.5613794758465;4923.261510773377;4935.185694360426;4754.738489383082;4761.547652972962;4811.903761924759;4835.830745923911;4842.297866809328;4761.8095276188915;4768.928466073012;4784.42586889572;4791.928121078186;4825.252085926687;4709.576138147549;4740.478547359788;4742.407199100113;4762.452317983407;4776.641751868589;5046.823361182378;5123.026624941286;5171.120909445403;5187.195984622352;5195.5324020837925;5543.334799824007;5579.414161513023;5579.609427340048;5585.162225666142;5590.664560126405;5598.636088654224;5599.552035837123;5601.383847776741;5688.345840228385;5714.114312281603;5322.893542129135;5359.892802143935;5365.946340536622;5382.407935127172;5387;5697.572682048863;5746;5750.3099628044065;5776.249087618583;5785.739641716133;5484.972575137099;5553.77784888608;5559.138333558305;5566.415526369754;5582.804601838916;5695.971520142372;5703.401142879938;5715.5427565794635;5740.68426236561;5743.8564035899435;5652.7738890443925;5695.259616249861;5698.31620205578;5698.401667824902;5730;5470.835874923759;5545.639533430314;5635.295588051494;5648.378678345379;5659.971700141473;4396.07682386696;4409.382686423904;4423.982484028691;4439.178751930903;4473.843415480443;3944.5463771666628;3975.463312452782;3976.5824588418377;3980.8606698765984;3995.4606128172904;5232.319798426181;5249.08141075318;5295.761690723926;5309.442508536626;5379.462053794589;5684.943150568524;5689.402612725687;5693.715314234271;5715.599908006399;5722.4277572242445;5284.497972692588;5348.438413966555;5349.518543331119;5354.571634269249;5370.355557333145;4792.2811578262845;4795.544423279783;4819.228923372314;4846.733429661403;4851.539103785135;5897.380775018647;5946.851328716817;5961.777835543703;6010.66941318223;6033.818985430444;5663.830085097454;5726.484616384545;5734.512566431733;5750.6837123958585;5750.884982300414;5775;5833.533317334518;5921.259842519685;5922.703864806828;5954.970225148846;5622.3815380307315;5682.602217844711;5695.145728140812;5697.145428185805;5741.45456181662;5710.743016564347;5753.568482363756;5754.712264386848;5776.8555786104;5781.508571771446;5501.504864562208;5533.806316778893;5594.944050559442;5622.409646987007;5629.437056294501;5540.7783688652;5542.584306177134;5579.721013949367;5581.218629391808;5582.441755824385;5498.202760599771;5520.033994051106;5521.337439507285;5536.390996990408;5570.498655121059;5446.1558458439;5467;5628;5681.971590142023;5698.515626171656;5441.591880609049;5488.643238189505;5521.585881058856;5521.861953451035;5525.861853453695 16:29:00 INFO - PROCESS | 14630 | |1;ext.html;513.9974300128497;515.4381723920926;516.5170565521236;532.936047674279;591.3495155329141;34700.30599388011;34767;34883;34985.47521787172;35097.824510877406;37869.810650946776;38446;38462.8076859616;38462.8076859616;38716.419253711145;8372.120927302636;8470.66117355305;8514.659413623447;8541.060483346826;8546.572671366406;8000.079990801045;8083.191680831899;8083.514989100673;8087.514749115043;8113.918860811375;8377.204165604258;8386.412951093396;8407.915920840775;8410.747677569683;8436.409451338408;8387.329013678922;8395.496270223744;8401.95799021007;8402;8423.410361274651;8544.273736732384;8587.570621468902;8606.010308814504;8653.567321633893;8666.610002549838;39206.41190382146;39745.60254397448;39819.40270895939;39868.60131398707;40002.399964000564;2931.912042638703;3031.4998025325795;3225;3352.6312105668358;3389.881354152593;29053.56419653707;29575.26061848471;29746.85126574375;29773.10680679583;29821.850890745623;3686.6681998619983;3687.11509237781;3721.3859713147567;3729.664330210294;3806.352920003606;262815;265240;265319;266093;266362;39621;39876.80369588917;39898.40152397716;40112;48587.5141248583;38635.22729545394;38738.612613874066;38780.80609596991;38841;39137;14043.36804843764;14191.077579957477;14281.14313141215;14283.857161428461;14291.85708142926;10748.89251107479;10774.19193560486;10835.241533092609;10851.945740271405;10965.945170274097;13798.586042418743;13839.792403113961;13962.162270263816;13964.441422343196;13974.161550307013;5771.6248443851855;5808.88382232353;5830.067189249699;5836.739180398333;5862.355140934494;956.2397893674546;960.5341409416427;967.7725734452398;1021.9933365634844;1056.3767377247461;27582.86208568944;30374.696253037186;31931.840340798146;32293.677063229068;32561;1027.429776474049;1038.522279751323;1054.5570860238718;1067.9572817087385;1103.4979084516526;13175;15429.30568124437;15878.841211587736;16176.191190440431;16443.177841107896;376673;378009;379286;380308;382769;53992.460075399526;54517.1822422664;54523.45476545263;54708;54879.451205488236;1318.6241921052454;1339.9732005360033;1349.527665317131;1351.9121257118256;1353.7833946568699;28557.143285701462;29210.56184157197;29234.269143270736;29293.414131717673;29403;44204.77897610491;44577.55422445864;44620.55379446294;44974;45103;300442;302178;302955;303061;303807;31625.20936976594;41008.38487422751;41466.170676585694;41637.37543936904;42222;37629.247415052094;38358.2328353437;38791;39001.414978774774;39165.41251881281;32082.518762219053;33122.83438582792;35174;35395.64604353924;35729.64270357367;34721.479177811845;35244.29511409809;35354.29291414209;35371.82314088413;35695.82152089223;34532.745541919736;34918;35087.12282192965;35091.82454087713;35444.291114178086;31684.841575792896;32118.678813212504;32435.269943956748;32584.83707581447;32653;24877.652117953214;24877.751222487543;24952.500949981262;24952.875235623706;25286.24141275765 16:29:00 INFO - PROCESS | 14630 | |2;jquery.html;348.8813803306876;356.060001595787;356.2678695281197;357.9552555930507;358.47662412877196;13459.192448453075;13895.930520347409;15980.360785568579;16039.51881443557;16455.917720411395;16075.919620401912;16280.4301849435;17055.658886822257;17101;17265.568360790985;5133.3326667533165;5364.839054828341;5402.270693456372;5421.430749771276;5427.348718153808;5269.604779641542;6065.363136870631;6234.563580549363;6244.843878903041;6264.404881536247;6239.908016097187;6300.747970081191;6694.631795251259;6755.459563234954;6779.35596118368;6558.409743123142;6692.866142677168;6714.731410743564;6753.561018533779;6834.384905358516;5991.490723288525;6474.643894585796;6509.121268628722;6509.1863517060365;6519.022146678036;22096.116155353768;22332.553348933092;22363.55272894549;22443.102275908943;22503.324900253017;2246.4383904023994;2247.3482690019873;2278.6695929090356;2289.645105008726;2449.6080627099755;13316.267605281706;13321.666958326023;13743.244121573309;13840.377183026789;14084.2957852107;1897.3169658922777;1963.6465436221474;2004.9398518044482;2008.4275981345393;2008.5982803439224;62313;64161.358386416;64189.67905160444;64472;65996.34003659998;14348.139111653334;15217.695646087017;15514.301856416489;15535.067895926055;15547.766783498031;23256.65115023276;23323;23372.181973630843;23599.17402890925;23658.645120322864;8750.562471876381;9158.67944621935;9187.310951678652;9232.538373081454;9269.95365023184;7806;7865.292123708894;7868.0951690555175;7902;7915.643796029192;4262.722923009995;4404.471463424409;4433.091216300651;4447.510773814878;7513.39892808574;1851.787044489874;1858.3774435563967;1874.062968515742;1879.9718004229946;1883.7551118354527;816.3632366753941;909.4497828813472;945.2343601682659;946.6213514594217;984.1536278800226;15544.378224870878;16003.959742616693;16022.19889005545;16151.434699785686;16280.837191628169;858.2533196119416;880.801819590587;913.3058875254721;917.5549858318843;998.5805961496189;8649.1350864913;8669.219770220585;8712.477251364939;8742.994555626057;8902.287816974756;519418;531027;531537;532314;545561;72054.63972680208;72497;73765.88575256718;74479.8072212067;76061.23938760652;1184.9822252666218;1188.2454641302663;1229.674136353867;1247.8440194975628;1260.338322380739;9778.119969202806;9796.608135674778;10123.544440500342;10233.692989210336;14061.929690351482;32338.514922275714;33332;35175.64824351724;35285.29429411346;36218.63781362153;45125.54874451345;46593.301100482844;47229.527704723885;48282.03435931332;50032.74983625059;9780.41317520951;10551.997560231766;10616;10718.571257149626;10733.892661073289;11052.131753886075;11133.721656958642;11629.069674426195;11690.357030363071;11823.586174483851;9294.488803115893;9401.059894010545;9426.198773104088;9446.811063778823;9555.761105972128;6936;7617.27635874591;7719.228077192236;7978.321842643209;10044.899551004397;6562.245341785565;7097.112860892388;7136.964315178391;7227.8554428912175;7262.9273707264365;10109.39343639384;10308.639197628047;10328.741781455523;10451.16390688728;10498.94750526273;9768.169705575106;9898.653547126105;9924.900750992398;9958.751031224278;10015.098641122335 16:29:00 INFO - PROCESS | 14630 | |3;mootools.html;1478.2460944918091;1498.7077519883624;1659.9336026558938;1771.4154329071391;1794.46166150155;6687.264400915896;6847.109875716163;7306.561606303626;7477.14012888518;7492.063492063492;6970.442364610832;7156.964215178929;7183.784486465402;7226.421886249101;7256.8911466328045;2267.5351552931693;2299.4481324482085;2307.711536057993;2309.2494939144763;2312.1329501436962;2238.4963383238724;2247.9887600562056;2275.6017696902977;2275.772422757719;2291.702078729763;2285.9771402285933;2319.5592837360846;2319.9304020879317;2320.153144102399;2331.5220379822094;2272.1479445208047;2273.181654604341;2281.3042022183226;2284.805791507724;2296.4488522754586;2278.1456953642382;2296.908123675051;2298.954020919572;2301.1945818963395;2304.8847557622053;7678.769636910902;7701.114371847198;7720.34377077949;7722.26249093955;7727.806804829925;4677.345171675968;4721.763911804431;4736.928946065812;4743.7628118594275;4776.188048031843;2975.7619390448926;2991.222282206642;3052.4963381042103;3074.047045415928;3075.3080556874747;921.9078092190795;922.3220932614523;925.7685578605349;933.4819175357674;975.6341371985505;10366.740831479197;10394;10409.479526023744;10454.268201225841;10463.215258855616;4325.697201195886;4348.499922508889;4366.061296821199;4394.231009573312;4410.558944105564;8923.955380223188;8959.910400896038;9007.594658240396;9018.098190181061;9019.052999435096;4780.354652121989;4824.107540105092;4833.879153021132;4836.347093142381;4850.708957462563;3890.6109389060866;3931.0761970936805;4211.241976444269;4384.539623339503;4386.561343865652;3624.5831729350934;3631.8365673544754;3642.125889786485;3649.8905032849057;3672.540932383452;1155.6879642496478;1161.5179700424399;1225.8957988570894;1228.705110773408;1249.1131296779388;1298.5000774701807;1299.4087690100982;1320.320035181882;1328.2163523520976;1330.2218202351733;6859.07402500666;6924.58452492852;7143.285671432815;7171.641417929082;7177.641117944082;476.8712447639118;487.18639871414115;491.29008582597805;491.3808601162561;494.48820470812535;5399.109146990702;5399.784008639689;5434.945650543444;5456.809011684572;5489.176623506506;8805;8865.64537418509;9089;9179.265658747285;9266.675666351646;9068.8639670405;9129.863052054225;9130.406523575946;9143.405678630868;9150.679726209552;7048.577085374894;7140.750073747394;7143.964280178566;7175.354218120498;7273.563586184846;6836.213835408793;6858.622775747382;6861.416779573792;6868.931310686829;6884.759033433806;7874.488158269694;8136.918630813853;8166.5916704163365;8210.753677389448;8296.377771667028;8221.506709597443;8288.58557072156;8308;8315.417920745489;8393.24460798531;6380.074889141141;6389.2971773105855;6447.3552644735155;6456.806295811133;6497.772577959749;7185.892211616934;7193.136823581203;7195.71217151329;7248.746293879689;7261.745838895613;6712.664366781543;6817.522773405814;6839.110915581142;6941.652917354213;7004.859902802017;6726.8654626908165;6742.056112144206;6792.66036698173;6838.350356716104;6861.828454288683;6707.865842683216;6769.424598908951;6816.829579260559;6836.248012718696;6839.487038472035;5899.4985426239255;5956.285245770535;5957.493613042767;5965.850853728692;5997.880042399041;6379.9681001596555;6385.457236134795;6402.775902843378;6432.131662225727;6437.227532696106 16:29:00 INFO - PROCESS | 14630 | |4;prototype.html;315.68904628940487;338.9186595217148;341.06207928197455;344.3766782124354;345.45073333399876;6238.750449982007;6254.343293954132;6254.718537665804;6345.650989195592;6494.5778524396;6208.720607572659;6209.720562574684;6219.067139929013;6251.3123556408755;6281.309056003847;4699.78850951708;4701.200795864711;4704.506026867181;4713.340132381478;4717.198076327033;4715;4716.4340279166545;4720.433547974248;4724.503927087658;4730.385049943519;4509.864704058883;4590.495045544987;4615.676902616819;4628.120657075162;4632.837850675227;4592.242280023792;4597.885052873671;4609.400777898885;4613.884652883671;4616.099860527199;3937.1338305572726;3964.790738824657;3978.124812541236;4001.659858911996;4016.698747593913;5871.324797648283;5915.792947246869;5918.171455996164;5924.052151655757;5953.910691339634;5236.371635403738;5340.145576707708;5390.353157621111;5406.864828379283;5408.053590621665;6545.770898018546;6598.901016484757;6629.436497897685;6640.501962352794;6674.399304062657;4494.325851122325;4500.077484115748;4513.571210734975;4519.141363141026;4522.7964741586375;6750.953602191668;6858.725650973955;6896.896546551806;6909.447244220451;6933.895991560131;4572.359869618256;4603.861884143481;4625.653076019312;4628.236341003764;4632.258838585877;4666.160091183551;4671.369365135731;4674.579287864109;4676.719396836133;4682.391289132391;5400.351957765093;5435.619506634498;5435.619506634576;5440.510354068074;5452.645578037414;6474.15835941334;6587.63767992765;6630.502712296597;6644.933550664528;6651;1614.7577863320596;1644.7286197777232;1653.115583163026;1653.3469279634478;1654.1729135432283;1089.9618513351995;1090.3076546393097;1094.529352378469;1116.2632662442911;1117.1621284036971;6289.8742025159245;6291.874162516724;6303.369663033752;6303.873922521524;6325.715342809584;6781.6609169541325;6800.93199068003;6811.114555107804;6821.317868213139;6844.315568443216;6232.439080482778;6278.905816412757;6311.368863113744;6403.359664033653;6416.486681065504;3697.759645623026;3704.148045949393;3717.683996860243;3720.981395093007;3746.3631182699005;7185.2814718527725;7205.423566114699;7247.673854676552;7251.56490610565;7270.309320614533;6974.674811785744;7062.788116356517;7122.109736282965;7132.964335178291;7138.750143744944;7213.242609525924;7241.167265764399;7255.709771609077;7257.383122434652;7270.382017528464;6864.4165245954655;6888.896666550106;6899.448044156556;6904.689288981907;6905.067815844796;6730.226024007106;6821.3519715626935;6831.521793474409;6845.007473916155;6857.27998560144;7213.062301900719;7227.566346019255;7255.927440725525;7270.382017528358;7277.636118193963;4554.089182163514;4577.153226653079;4595.0809838031855;4612.054528821516;4616.930746038879;6821.2155602106395;6866.313368663294;6929.272426395156;6931.584104953719;6935.445164386938;6696.330366963265;6710.865782684221;6717.966410167918;6739.932600674127;6740.090087838079;6579.440747536321;6591.769288074895;6661.067450556829;6666.633335166613;6702.631355275506;6605.471562275103;6611.801645950437;6613.404793568409;6614.536982411185;6620.172478440195;6752.763653272112;6762.729490820312;6770.289119642367;6775.220849602161;6778.051072849904;6404.967975160094;6564.6389448578875;6575.210974683068;6582.967085164543;6588 16:29:00 INFO - PROCESS | 14630 | |5;yui.html;649.5388274325229;660.4155322539551;694.6769752065288;710.3732452683349;748.6967778049892;13288.202707837525;13567.389467473962;13603.591892243223;13609.38757755901;13630.522931697393;12679;12722.427490762915;12752.744945101093;12816;12824.487020519167;802.7752229375754;835.031363618203;836.2431999040878;836.4521238588734;837.4054421360811;810.9918900811005;816.8897198878135;822.8313195794848;826.6445428465757;827.594478705436;850.5704619167312;852.1861622150863;855.0722466124263;856.9271611912994;858.5964596639569;851.0680804519042;851.9105493923173;859.9613017414231;860.2730692564772;860.6643409070437;628.0108828594936;628.6039794929166;628.6510986402545;629.5058379172327;631.782035197856;13500;13550.119242249222;13554.864451355557;13565.660858478617;13617.523386681418;11727.413629318586;11903.583374581847;11939.88060119405;12011.819822702666;12137.635870923887;9617;9770.218382529452;9790.755231119208;9897.4556399398;10110.848337274947;3390.55922730046;3406.199543107368;3456.1705190754287;3482.9825850870584;3505.3164632896596;46014.76992615049;46069.5393046072;46396;46552.53447465516;46661.366852160354;9051.683191088281;9092.636294548276;9102.180803727697;9110.271178305853;9188.081191880892;15879.28543215558;15950.441734539236;15981.840181598036;16052.919735401481;16155.11146886909;6747.730090796412;6929.5842249465195;6989;7143.24995875436;7180.712771489082;4019.517657881073;4029.073313137995;4074.103697186614;4093.672506199497;4103.261412945699;2871.239121632769;2875.0368626510353;2883.452144092658;2885.422915416925;2887.6823549409546;541.2665837789817;556.6715637773733;560.5851669764345;565.0507147991332;568.590614757374;543.6411968101035;609.472806022787;614.3978900677362;640.8045546108389;648.2124219073847;7923.524588524707;8010.719624813103;8208.507489550646;8218.260356567938;8339.166083391612;522.8588281164065;607.0711810929197;631.5642902609789;645.2289514030688;699.1121275979477;3878.7090968176935;3918.529776426847;3920.2159568086495;3957.6240257175523;4013.0970531630733;48802.267965980536;48834.755826220644;49081.75459122753;49363.753181234584;49397;48493.515064849606;48818.5118148814;53410;54918.17622735662;55621.72189139109;43138.35292470615;43544.56455435405;43624.3456348155;43858;44751.55248447474;8351.624176911931;8374;8422.536760478233;8507.95746021266;8613.09562495929;31832.36335273235;32328.83835580807;32994;33043.66956330406;33326.66673333236;37555.81222093872;37654.62345376511;40664.59335406608;40750.59249407468;41470.377944330256;10676.733081673021;10724.463776811284;10747;10856.511456984612;10909.945450272699;11150.832737509107;11173.273737207055;11509.251898626562;12034.879651203375;12106.334151621746;10778.946105269424;10833.241673083125;10884.346939183675;11353.54585816558;11475.713107172387;10535.841962370723;10552.525136369035;10731;11188.552457901593;11216.327020378803;10607.575696972035;10682.62610808618;10823.891761082288;11042.447877605928;11218.719532011764;9062;9216.314668471265;9330.160285574331;9557.61769529211;9666.661666841626;8518.23335899772;8612.267957223707;9367.665125198313;9431.905680943377;9517.55890673875 16:29:00 INFO - PROCESS | 14630 | __end_tp_report 16:29:00 INFO - PROCESS | 14630 | __start_cc_report 16:29:00 INFO - PROCESS | 14630 | _x_x_mozilla_cycle_collect,307 16:29:00 INFO - PROCESS | 14630 | __end_cc_report 16:29:00 INFO - PROCESS | 14630 | __startTimestamp1454113740224__endTimestamp 16:29:00 INFO - PROCESS | 14630 | 16:29:00 INFO - PROCESS | 14630 | ------- Summary: start ------- 16:29:00 INFO - PROCESS | 14630 | Number of tests: 6 16:29:00 INFO - PROCESS | 14630 | 16:29:00 INFO - PROCESS | 14630 | [#0] dojo.html Cycles:165 Average:5276.61 Median:5501.50 stddev:579.45 (10.5%) stddev-sans-first:557.90 16:29:00 INFO - PROCESS | 14630 | Values: 3201.7 3219.9 3244.0 3261.4 3271.6 5177.9 5254.2 5278.5 5317.5 5317.5 5181.0 5183.8 5255.3 5264.4 5330.4 4795.8 4800.4 4824.0 4856.7 4943.7 4554.2 4868.2 4873.6 4923.3 4935.2 4754.7 4761.5 4811.9 4835.8 4842.3 4761.8 4768.9 4784.4 4791.9 4825.3 4709.6 4740.5 4742.4 4762.5 4776.6 5046.8 5123.0 5171.1 5187.2 5195.5 5543.3 5579.4 5579.6 5585.2 5590.7 5598.6 5599.6 5601.4 5688.3 5714.1 5322.9 5359.9 5365.9 5382.4 5387.0 5697.6 5746.0 5750.3 5776.2 5785.7 5485.0 5553.8 5559.1 5566.4 5582.8 5696.0 5703.4 5715.5 5740.7 5743.9 5652.8 5695.3 5698.3 5698.4 5730.0 5470.8 5545.6 5635.3 5648.4 5660.0 4396.1 4409.4 4424.0 4439.2 4473.8 3944.5 3975.5 3976.6 3980.9 3995.5 5232.3 5249.1 5295.8 5309.4 5379.5 5684.9 5689.4 5693.7 5715.6 5722.4 5284.5 5348.4 5349.5 5354.6 5370.4 4792.3 4795.5 4819.2 4846.7 4851.5 5897.4 5946.9 5961.8 6010.7 6033.8 5663.8 5726.5 5734.5 5750.7 5750.9 5775.0 5833.5 5921.3 5922.7 5955.0 5622.4 5682.6 5695.1 5697.1 5741.5 5710.7 5753.6 5754.7 5776.9 5781.5 5501.5 5533.8 5594.9 5622.4 5629.4 5540.8 5542.6 5579.7 5581.2 5582.4 5498.2 5520.0 5521.3 5536.4 5570.5 5446.2 5467.0 5628.0 5682.0 5698.5 5441.6 5488.6 5521.6 5521.9 5525.9 16:29:00 INFO - PROCESS | 14630 | 16:29:00 INFO - PROCESS | 14630 | [#1] ext.html Cycles:180 Average:46736.15 Median:35570.06 stddev:83878.13 (235.8%) stddev-sans-first:84041.64 16:29:00 INFO - PROCESS | 14630 | Values: 514.0 515.4 516.5 532.9 591.3 34700.3 34767.0 34883.0 34985.5 35097.8 37869.8 38446.0 38462.8 38462.8 38716.4 8372.1 8470.7 8514.7 8541.1 8546.6 8000.1 8083.2 8083.5 8087.5 8113.9 8377.2 8386.4 8407.9 8410.7 8436.4 8387.3 8395.5 8402.0 8402.0 8423.4 8544.3 8587.6 8606.0 8653.6 8666.6 39206.4 39745.6 39819.4 39868.6 40002.4 2931.9 3031.5 3225.0 3352.6 3389.9 29053.6 29575.3 29746.9 29773.1 29821.9 3686.7 3687.1 3721.4 3729.7 3806.4 262815.0 265240.0 265319.0 266093.0 266362.0 39621.0 39876.8 39898.4 40112.0 48587.5 38635.2 38738.6 38780.8 38841.0 39137.0 14043.4 14191.1 14281.1 14283.9 14291.9 10748.9 10774.2 10835.2 10851.9 10965.9 13798.6 13839.8 13962.2 13964.4 13974.2 5771.6 5808.9 5830.1 5836.7 5862.4 956.2 960.5 967.8 1022.0 1056.4 27582.9 30374.7 31931.8 32293.7 32561.0 1027.4 1038.5 1054.6 1068.0 1103.5 13175.0 15429.3 15878.8 16176.2 16443.2 376673.0 378009.0 379286.0 380308.0 382769.0 53992.5 54517.2 54523.5 54708.0 54879.5 1318.6 1340.0 1349.5 1351.9 1353.8 28557.1 29210.6 29234.3 29293.4 29403.0 44204.8 44577.6 44620.6 44974.0 45103.0 300442.0 302178.0 302955.0 303061.0 303807.0 31625.2 41008.4 41466.2 41637.4 42222.0 37629.2 38358.2 38791.0 39001.4 39165.4 32082.5 33122.8 35174.0 35395.6 35729.6 34721.5 35244.3 35354.3 35371.8 35695.8 34532.7 34918.0 35087.1 35091.8 35444.3 31684.8 32118.7 32435.3 32584.8 32653.0 24877.7 24877.8 24952.5 24952.9 25286.2 16:29:00 INFO - PROCESS | 14630 | 16:29:00 INFO - PROCESS | 14630 | [#2] jquery.html Cycles:180 Average:28426.86 Median:47755.78 stddev:86916.79 (182.0%) stddev-sans-first:87135.04 16:29:00 INFO - PROCESS | 14630 | Values: 348.9 356.1 356.3 358.0 358.5 13459.2 13895.9 15980.4 16039.5 16455.9 16075.9 16280.4 17055.7 17101.0 17265.6 5133.3 5364.8 5402.3 5421.4 5427.3 5269.6 6065.4 6234.6 6244.8 6264.4 6239.9 6300.7 6694.6 6755.5 6779.4 6558.4 6692.9 6714.7 6753.6 6834.4 5991.5 6474.6 6509.1 6509.2 6519.0 22096.1 22332.6 22363.6 22443.1 22503.3 2246.4 2247.3 2278.7 2289.6 2449.6 13316.3 13321.7 13743.2 13840.4 14084.3 1897.3 1963.6 2004.9 2008.4 2008.6 62313.0 64161.4 64189.7 64472.0 65996.3 14348.1 15217.7 15514.3 15535.1 15547.8 23256.7 23323.0 23372.2 23599.2 23658.6 8750.6 9158.7 9187.3 9232.5 9270.0 7806.0 7865.3 7868.1 7902.0 7915.6 4262.7 4404.5 4433.1 4447.5 7513.4 1851.8 1858.4 1874.1 1880.0 1883.8 816.4 909.4 945.2 946.6 984.2 15544.4 16004.0 16022.2 16151.4 16280.8 858.3 880.8 913.3 917.6 998.6 8649.1 8669.2 8712.5 8743.0 8902.3 519418.0 531027.0 531537.0 532314.0 545561.0 72054.6 72497.0 73765.9 74479.8 76061.2 1185.0 1188.2 1229.7 1247.8 1260.3 9778.1 9796.6 10123.5 10233.7 14061.9 32338.5 33332.0 35175.6 35285.3 36218.6 45125.5 46593.3 47229.5 48282.0 50032.7 9780.4 10552.0 10616.0 10718.6 10733.9 11052.1 11133.7 11629.1 11690.4 11823.6 9294.5 9401.1 9426.2 9446.8 9555.8 6936.0 7617.3 7719.2 7978.3 10044.9 6562.2 7097.1 7137.0 7227.9 7262.9 10109.4 10308.6 10328.7 10451.2 10498.9 9768.2 9898.7 9924.9 9958.8 10015.1 16:29:00 INFO - PROCESS | 14630 | 16:29:00 INFO - PROCESS | 14630 | [#3] mootools.html Cycles:180 Average:5300.61 Median:6380.02 stddev:2721.21 (42.7%) stddev-sans-first:2713.68 16:29:00 INFO - PROCESS | 14630 | Values: 1478.2 1498.7 1659.9 1771.4 1794.5 6687.3 6847.1 7306.6 7477.1 7492.1 6970.4 7157.0 7183.8 7226.4 7256.9 2267.5 2299.4 2307.7 2309.2 2312.1 2238.5 2248.0 2275.6 2275.8 2291.7 2286.0 2319.6 2319.9 2320.2 2331.5 2272.1 2273.2 2281.3 2284.8 2296.4 2278.1 2296.9 2299.0 2301.2 2304.9 7678.8 7701.1 7720.3 7722.3 7727.8 4677.3 4721.8 4736.9 4743.8 4776.2 2975.8 2991.2 3052.5 3074.0 3075.3 921.9 922.3 925.8 933.5 975.6 10366.7 10394.0 10409.5 10454.3 10463.2 4325.7 4348.5 4366.1 4394.2 4410.6 8924.0 8959.9 9007.6 9018.1 9019.1 4780.4 4824.1 4833.9 4836.3 4850.7 3890.6 3931.1 4211.2 4384.5 4386.6 3624.6 3631.8 3642.1 3649.9 3672.5 1155.7 1161.5 1225.9 1228.7 1249.1 1298.5 1299.4 1320.3 1328.2 1330.2 6859.1 6924.6 7143.3 7171.6 7177.6 476.9 487.2 491.3 491.4 494.5 5399.1 5399.8 5434.9 5456.8 5489.2 8805.0 8865.6 9089.0 9179.3 9266.7 9068.9 9129.9 9130.4 9143.4 9150.7 7048.6 7140.8 7144.0 7175.4 7273.6 6836.2 6858.6 6861.4 6868.9 6884.8 7874.5 8136.9 8166.6 8210.8 8296.4 8221.5 8288.6 8308.0 8315.4 8393.2 6380.1 6389.3 6447.4 6456.8 6497.8 7185.9 7193.1 7195.7 7248.7 7261.7 6712.7 6817.5 6839.1 6941.7 7004.9 6726.9 6742.1 6792.7 6838.4 6861.8 6707.9 6769.4 6816.8 6836.2 6839.5 5899.5 5956.3 5957.5 5965.9 5997.9 6380.0 6385.5 6402.8 6432.1 6437.2 16:29:00 INFO - PROCESS | 14630 | 16:29:00 INFO - PROCESS | 14630 | [#4] prototype.html Cycles:180 Average:5535.84 Median:6290.87 stddev:1714.74 (27.3%) stddev-sans-first:1674.18 16:29:00 INFO - PROCESS | 14630 | Values: 315.7 338.9 341.1 344.4 345.5 6238.8 6254.3 6254.7 6345.7 6494.6 6208.7 6209.7 6219.1 6251.3 6281.3 4699.8 4701.2 4704.5 4713.3 4717.2 4715.0 4716.4 4720.4 4724.5 4730.4 4509.9 4590.5 4615.7 4628.1 4632.8 4592.2 4597.9 4609.4 4613.9 4616.1 3937.1 3964.8 3978.1 4001.7 4016.7 5871.3 5915.8 5918.2 5924.1 5953.9 5236.4 5340.1 5390.4 5406.9 5408.1 6545.8 6598.9 6629.4 6640.5 6674.4 4494.3 4500.1 4513.6 4519.1 4522.8 6751.0 6858.7 6896.9 6909.4 6933.9 4572.4 4603.9 4625.7 4628.2 4632.3 4666.2 4671.4 4674.6 4676.7 4682.4 5400.4 5435.6 5435.6 5440.5 5452.6 6474.2 6587.6 6630.5 6644.9 6651.0 1614.8 1644.7 1653.1 1653.3 1654.2 1090.0 1090.3 1094.5 1116.3 1117.2 6289.9 6291.9 6303.4 6303.9 6325.7 6781.7 6800.9 6811.1 6821.3 6844.3 6232.4 6278.9 6311.4 6403.4 6416.5 3697.8 3704.1 3717.7 3721.0 3746.4 7185.3 7205.4 7247.7 7251.6 7270.3 6974.7 7062.8 7122.1 7133.0 7138.8 7213.2 7241.2 7255.7 7257.4 7270.4 6864.4 6888.9 6899.4 6904.7 6905.1 6730.2 6821.4 6831.5 6845.0 6857.3 7213.1 7227.6 7255.9 7270.4 7277.6 4554.1 4577.2 4595.1 4612.1 4616.9 6821.2 6866.3 6929.3 6931.6 6935.4 6696.3 6710.9 6718.0 6739.9 6740.1 6579.4 6591.8 6661.1 6666.6 6702.6 6605.5 6611.8 6613.4 6614.5 6620.2 6752.8 6762.7 6770.3 6775.2 6778.1 6405.0 6564.6 6575.2 6583.0 6588.0 16:29:00 INFO - PROCESS | 14630 | 16:29:00 INFO - PROCESS | 14630 | [#5] yui.html Cycles:180 Average:13015.60 Median:47577.44 stddev:14846.16 (31.2%) stddev-sans-first:14858.77 16:29:00 INFO - PROCESS | 14630 | Values: 649.5 660.4 694.7 710.4 748.7 13288.2 13567.4 13603.6 13609.4 13630.5 12679.0 12722.4 12752.7 12816.0 12824.5 802.8 835.0 836.2 836.5 837.4 811.0 816.9 822.8 826.6 827.6 850.6 852.2 855.1 856.9 858.6 851.1 851.9 860.0 860.3 860.7 628.0 628.6 628.7 629.5 631.8 13500.0 13550.1 13554.9 13565.7 13617.5 11727.4 11903.6 11939.9 12011.8 12137.6 9617.0 9770.2 9790.8 9897.5 10110.8 3390.6 3406.2 3456.2 3483.0 3505.3 46014.8 46069.5 46396.0 46552.5 46661.4 9051.7 9092.6 9102.2 9110.3 9188.1 15879.3 15950.4 15981.8 16052.9 16155.1 6747.7 6929.6 6989.0 7143.2 7180.7 4019.5 4029.1 4074.1 4093.7 4103.3 2871.2 2875.0 2883.5 2885.4 2887.7 541.3 556.7 560.6 565.1 568.6 543.6 609.5 614.4 640.8 648.2 7923.5 8010.7 8208.5 8218.3 8339.2 522.9 607.1 631.6 645.2 699.1 3878.7 3918.5 3920.2 3957.6 4013.1 48802.3 48834.8 49081.8 49363.8 49397.0 48493.5 48818.5 53410.0 54918.2 55621.7 43138.4 43544.6 43624.3 43858.0 44751.6 8351.6 8374.0 8422.5 8508.0 8613.1 31832.4 32328.8 32994.0 33043.7 33326.7 37555.8 37654.6 40664.6 40750.6 41470.4 10676.7 10724.5 10747.0 10856.5 10909.9 11150.8 11173.3 11509.3 12034.9 12106.3 10778.9 10833.2 10884.3 11353.5 11475.7 10535.8 10552.5 10731.0 11188.6 11216.3 10607.6 10682.6 10823.9 11042.4 11218.7 9062.0 9216.3 9330.2 9557.6 9666.7 8518.2 8612.3 9367.7 9431.9 9517.6 16:29:00 INFO - PROCESS | 14630 | -------- Summary: end -------- 16:29:00 INFO - PROCESS | 14630 | 16:29:00 INFO - TEST-INFO | 14630: exit 0 16:29:00 INFO - TEST-OK | dromaeo_css | took 1109876ms 16:29:00 INFO - TEST-START | kraken 16:29:00 INFO - operating with platform_type : linux_ 16:29:00 INFO - Initialising browser for kraken test... 16:29:00 INFO - TEST-INFO | started process 14873 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmptslWaq/profile http://localhost:58738/getInfo.html) 16:29:04 INFO - PROCESS | 14873 | 16:29:04 INFO - PROCESS | 14873 | (process:14946): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:29:05 INFO - PROCESS | 14873 | __metrics Screen width/height:1600/1200 16:29:05 INFO - PROCESS | 14873 | colorDepth:24 16:29:05 INFO - PROCESS | 14873 | Browser inner width/height: 1024/697 16:29:05 INFO - PROCESS | 14873 | __metrics 16:29:05 INFO - PROCESS | 14873 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 16:29:06 INFO - TEST-INFO | 14873: exit 0 16:29:06 INFO - Browser initialized. 16:29:06 INFO - Running cycle 1/1 for kraken test... 16:29:06 INFO - TEST-INFO | started process 14995 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmptslWaq/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:29:07 INFO - PROCESS | 14995 | 16:29:07 INFO - PROCESS | 14995 | (process:15054): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:29:18 INFO - PROCESS | 14995 | RSS: Main: 152055808 16:29:18 INFO - PROCESS | 14995 | 16:29:20 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:58738/tests/kraken/driver.html?testName=audio-beat-detection) 16:29:21 INFO - PROCESS | 14995 | RSS: Main: 157003776 16:29:21 INFO - PROCESS | 14995 | 16:29:23 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:58738/tests/kraken/driver.html?testName=audio-dft) 16:29:24 INFO - PROCESS | 14995 | RSS: Main: 158699520 16:29:24 INFO - PROCESS | 14995 | 16:29:27 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:58738/tests/kraken/driver.html?testName=audio-fft) 16:29:27 INFO - PROCESS | 14995 | RSS: Main: 152932352 16:29:27 INFO - PROCESS | 14995 | 16:29:30 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:58738/tests/kraken/driver.html?testName=audio-oscillator) 16:29:30 INFO - PROCESS | 14995 | RSS: Main: 153014272 16:29:30 INFO - PROCESS | 14995 | 16:29:33 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:58738/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:29:33 INFO - PROCESS | 14995 | RSS: Main: 153657344 16:29:33 INFO - PROCESS | 14995 | 16:29:36 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:58738/tests/kraken/driver.html?testName=imaging-darkroom) 16:29:37 INFO - PROCESS | 14995 | RSS: Main: 153260032 16:29:37 INFO - PROCESS | 14995 | 16:29:40 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:58738/tests/kraken/driver.html?testName=imaging-desaturate) 16:29:41 INFO - PROCESS | 14995 | RSS: Main: 153681920 16:29:41 INFO - PROCESS | 14995 | 16:29:44 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:58738/tests/kraken/driver.html?testName=json-parse-financial) 16:29:44 INFO - PROCESS | 14995 | RSS: Main: 155869184 16:29:44 INFO - PROCESS | 14995 | 16:29:46 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:58738/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:29:46 INFO - PROCESS | 14995 | RSS: Main: 156151808 16:29:46 INFO - PROCESS | 14995 | 16:29:48 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:58738/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:29:49 INFO - PROCESS | 14995 | RSS: Main: 154345472 16:29:49 INFO - PROCESS | 14995 | 16:29:51 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:58738/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:29:51 INFO - PROCESS | 14995 | RSS: Main: 156741632 16:29:51 INFO - PROCESS | 14995 | 16:29:54 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:58738/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:29:54 INFO - PROCESS | 14995 | RSS: Main: 154931200 16:29:54 INFO - PROCESS | 14995 | 16:29:57 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:58738/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:29:58 INFO - PROCESS | 14995 | RSS: Main: 156536832 16:29:58 INFO - PROCESS | 14995 | 16:29:59 INFO - PROCESS | 14995 | Cycle 1(1): loaded http://localhost:58738/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:58738/tests/kraken/driver.html?testName=ai-astar) 16:30:00 INFO - PROCESS | 14995 | RSS: Main: 156835840 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | __start_tp_report 16:30:00 INFO - PROCESS | 14995 | _x_x_mozilla_page_load 16:30:00 INFO - PROCESS | 14995 | _x_x_mozilla_page_load_details 16:30:00 INFO - PROCESS | 14995 | |i|pagename|runs| 16:30:00 INFO - PROCESS | 14995 | |0;ai-astar;112;106;113;112;112;124;114;110;114;113 16:30:00 INFO - PROCESS | 14995 | |1;audio-beat-detection;150;134;153;158;137;160;156;128;168;125 16:30:00 INFO - PROCESS | 14995 | |2;audio-dft;164;162;163;162;162;162;164;169;170;164 16:30:00 INFO - PROCESS | 14995 | |3;audio-fft;75;73;75;74;73;139;76;76;73;76 16:30:00 INFO - PROCESS | 14995 | |4;audio-oscillator;95;95;135;95;95;96;138;95;96;132 16:30:00 INFO - PROCESS | 14995 | |5;imaging-gaussian-blur;118;115;115;115;115;115;115;115;115;115 16:30:00 INFO - PROCESS | 14995 | |6;imaging-darkroom;147;147;146;146;148;147;146;146;147;148 16:30:00 INFO - PROCESS | 14995 | |7;imaging-desaturate;96;96;97;97;98;97;96;96;97;96 16:30:00 INFO - PROCESS | 14995 | |8;json-parse-financial;59;61;59;58;58;57;58;59;58;56 16:30:00 INFO - PROCESS | 14995 | |9;json-stringify-tinderbox;66;66;68;67;68;67;66;67;68;66 16:30:00 INFO - PROCESS | 14995 | |10;stanford-crypto-aes;85;85;85;92;85;84;92;84;97;86 16:30:00 INFO - PROCESS | 14995 | |11;stanford-crypto-ccm;120;120;129;130;137;115;124;129;116;115 16:30:00 INFO - PROCESS | 14995 | |12;stanford-crypto-pbkdf2;143;167;151;152;142;149;153;154;150;139 16:30:00 INFO - PROCESS | 14995 | |13;stanford-crypto-sha256-iterative;70;71;72;72;69;69;68;67;72;67 16:30:00 INFO - PROCESS | 14995 | __end_tp_report 16:30:00 INFO - PROCESS | 14995 | __start_cc_report 16:30:00 INFO - PROCESS | 14995 | _x_x_mozilla_cycle_collect,740 16:30:00 INFO - PROCESS | 14995 | __end_cc_report 16:30:00 INFO - PROCESS | 14995 | __startTimestamp1454113800135__endTimestamp 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | ------- Summary: start ------- 16:30:00 INFO - PROCESS | 14995 | Number of tests: 14 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#0] ai-astar Cycles:10 Average:113.00 Median:113.00 stddev:4.52 (4.0%) stddev-sans-first:4.78 16:30:00 INFO - PROCESS | 14995 | Values: 112.0 106.0 113.0 112.0 112.0 124.0 114.0 110.0 114.0 113.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#1] audio-beat-detection Cycles:10 Average:146.90 Median:154.50 stddev:14.80 (9.6%) stddev-sans-first:15.65 16:30:00 INFO - PROCESS | 14995 | Values: 150.0 134.0 153.0 158.0 137.0 160.0 156.0 128.0 168.0 125.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#2] audio-dft Cycles:10 Average:164.20 Median:164.00 stddev:2.94 (1.8%) stddev-sans-first:3.11 16:30:00 INFO - PROCESS | 14995 | Values: 164.0 162.0 163.0 162.0 162.0 162.0 164.0 169.0 170.0 164.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#3] audio-fft Cycles:10 Average:81.00 Median:75.00 stddev:20.42 (27.2%) stddev-sans-first:21.54 16:30:00 INFO - PROCESS | 14995 | Values: 75.0 73.0 75.0 74.0 73.0 139.0 76.0 76.0 73.0 76.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#4] audio-oscillator Cycles:10 Average:107.20 Median:95.00 stddev:19.24 (20.3%) stddev-sans-first:19.89 16:30:00 INFO - PROCESS | 14995 | Values: 95.0 95.0 135.0 95.0 95.0 96.0 138.0 95.0 96.0 132.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#5] imaging-gaussian-blur Cycles:10 Average:115.30 Median:115.00 stddev:0.95 (0.8%) stddev-sans-first:0.00 16:30:00 INFO - PROCESS | 14995 | Values: 118.0 115.0 115.0 115.0 115.0 115.0 115.0 115.0 115.0 115.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#6] imaging-darkroom Cycles:10 Average:146.80 Median:147.00 stddev:0.79 (0.5%) stddev-sans-first:0.83 16:30:00 INFO - PROCESS | 14995 | Values: 147.0 147.0 146.0 146.0 148.0 147.0 146.0 146.0 147.0 148.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#7] imaging-desaturate Cycles:10 Average:96.60 Median:97.00 stddev:0.70 (0.7%) stddev-sans-first:0.71 16:30:00 INFO - PROCESS | 14995 | Values: 96.0 96.0 97.0 97.0 98.0 97.0 96.0 96.0 97.0 96.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#8] json-parse-financial Cycles:10 Average:58.30 Median:58.50 stddev:1.34 (2.3%) stddev-sans-first:1.39 16:30:00 INFO - PROCESS | 14995 | Values: 59.0 61.0 59.0 58.0 58.0 57.0 58.0 59.0 58.0 56.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#9] json-stringify-tinderbox Cycles:10 Average:66.90 Median:67.00 stddev:0.88 (1.3%) stddev-sans-first:0.87 16:30:00 INFO - PROCESS | 14995 | Values: 66.0 66.0 68.0 67.0 68.0 67.0 66.0 67.0 68.0 66.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#10] stanford-crypto-aes Cycles:10 Average:87.50 Median:85.50 stddev:4.50 (5.3%) stddev-sans-first:4.68 16:30:00 INFO - PROCESS | 14995 | Values: 85.0 85.0 85.0 92.0 85.0 84.0 92.0 84.0 97.0 86.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#11] stanford-crypto-ccm Cycles:10 Average:123.50 Median:126.50 stddev:7.53 (6.0%) stddev-sans-first:7.88 16:30:00 INFO - PROCESS | 14995 | Values: 120.0 120.0 129.0 130.0 137.0 115.0 124.0 129.0 116.0 115.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:150.00 Median:151.50 stddev:7.85 (5.2%) stddev-sans-first:7.90 16:30:00 INFO - PROCESS | 14995 | Values: 143.0 167.0 151.0 152.0 142.0 149.0 153.0 154.0 150.0 139.0 16:30:00 INFO - PROCESS | 14995 | 16:30:00 INFO - PROCESS | 14995 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.70 Median:70.50 stddev:2.00 (2.8%) stddev-sans-first:2.12 16:30:00 INFO - PROCESS | 14995 | Values: 70.0 71.0 72.0 72.0 69.0 69.0 68.0 67.0 72.0 67.0 16:30:00 INFO - PROCESS | 14995 | -------- Summary: end -------- 16:30:00 INFO - PROCESS | 14995 | 16:30:01 INFO - TEST-INFO | 14995: exit 0 16:30:01 INFO - TEST-OK | kraken | took 60188ms 16:30:01 INFO - SUITE-END | took 1170s 16:30:01 INFO - Completed test suite (00:19:30) 16:30:01 INFO - Working with test: dromaeo_css 16:30:01 INFO - Generating results file: dromaeo_css 16:30:01 INFO - Working with test: kraken 16:30:01 INFO - Generating results file: kraken 16:30:01 INFO - javascript benchmark 16:30:01 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:30:01 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,1,43]] 16:30:01 INFO - process_Request line: dromaeo_css 6875.00 graph.html#tests=[[72,1,43]] 16:30:01 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:30:01 INFO - process_Request line: kraken 1526.90 graph.html#tests=[[232,1,43]] 16:30:01 INFO - RETURN: dromaeo_css: 6875.00 16:30:01 INFO - RETURN: kraken: 1526.90 16:30:01 INFO - javascript benchmark 16:30:01 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3201.7278531324837, 3219.9356012879744, 3244.0267919624107, 3261.3640340133675, 3271.6237632672237, 5177.896442071156, 5254.211868219764, 5278.498542638443, 5317.521423071923, 5317.5214230719275, 5181.041507321139, 5183.766730497127, 5255.264263003182, 5264.42091369949, 5330.413654498002, 4795.808167673289, 4800.447948485934, 4824.035192961404, 4856.68431551948, 4943.6539442239055, 4554.180247555439, 4868.221084626461, 4873.5613794758465, 4923.261510773377, 4935.185694360426, 4754.738489383082, 4761.547652972962, 4811.903761924759, 4835.830745923911, 4842.297866809328, 4761.8095276188915, 4768.928466073012, 4784.42586889572, 4791.928121078186, 4825.252085926687, 4709.576138147549, 4740.478547359788, 4742.407199100113, 4762.452317983407, 4776.641751868589, 5046.823361182378, 5123.026624941286, 5171.120909445403, 5187.195984622352, 5195.5324020837925, 5543.334799824007, 5579.414161513023, 5579.609427340048, 5585.162225666142, 5590.664560126405, 5598.636088654224, 5599.552035837123, 5601.383847776741, 5688.345840228385, 5714.114312281603, 5322.893542129135, 5359.892802143935, 5365.946340536622, 5382.407935127172, 5387.0, 5697.572682048863, 5746.0, 5750.3099628044065, 5776.249087618583, 5785.739641716133, 5484.972575137099, 5553.77784888608, 5559.138333558305, 5566.415526369754, 5582.804601838916, 5695.971520142372, 5703.401142879938, 5715.5427565794635, 5740.68426236561, 5743.8564035899435, 5652.7738890443925, 5695.259616249861, 5698.31620205578, 5698.401667824902, 5730.0, 5470.835874923759, 5545.639533430314, 5635.295588051494, 5648.378678345379, 5659.971700141473, 4396.07682386696, 4409.382686423904, 4423.982484028691, 4439.178751930903, 4473.843415480443, 3944.5463771666628, 3975.463312452782, 3976.5824588418377, 3980.8606698765984, 3995.4606128172904, 5232.319798426181, 5249.08141075318, 5295.761690723926, 5309.442508536626, 5379.462053794589, 5684.943150568524, 5689.402612725687, 5693.715314234271, 5715.599908006399, 5722.4277572242445, 5284.497972692588, 5348.438413966555, 5349.518543331119, 5354.571634269249, 5370.355557333145, 4792.2811578262845, 4795.544423279783, 4819.228923372314, 4846.733429661403, 4851.539103785135, 5897.380775018647, 5946.851328716817, 5961.777835543703, 6010.66941318223, 6033.818985430444, 5663.830085097454, 5726.484616384545, 5734.512566431733, 5750.6837123958585, 5750.884982300414, 5775.0, 5833.533317334518, 5921.259842519685, 5922.703864806828, 5954.970225148846, 5622.3815380307315, 5682.602217844711, 5695.145728140812, 5697.145428185805, 5741.45456181662, 5710.743016564347, 5753.568482363756, 5754.712264386848, 5776.8555786104, 5781.508571771446, 5501.504864562208, 5533.806316778893, 5594.944050559442, 5622.409646987007, 5629.437056294501, 5540.7783688652, 5542.584306177134, 5579.721013949367, 5581.218629391808, 5582.441755824385, 5498.202760599771, 5520.033994051106, 5521.337439507285, 5536.390996990408, 5570.498655121059, 5446.1558458439, 5467.0, 5628.0, 5681.971590142023, 5698.515626171656, 5441.591880609049, 5488.643238189505, 5521.585881058856, 5521.861953451035, 5525.861853453695], "unit": "score", "name": "dojo.html", "value": 5239.975928228956}, {"lowerIsBetter": false, "replicates": [513.9974300128497, 515.4381723920926, 516.5170565521236, 532.936047674279, 591.3495155329141, 34700.30599388011, 34767.0, 34883.0, 34985.47521787172, 35097.824510877406, 37869.810650946776, 38446.0, 38462.8076859616, 38462.8076859616, 38716.419253711145, 8372.120927302636, 8470.66117355305, 8514.659413623447, 8541.060483346826, 8546.572671366406, 8000.079990801045, 8083.191680831899, 8083.514989100673, 8087.514749115043, 8113.918860811375, 8377.204165604258, 8386.412951093396, 8407.915920840775, 8410.747677569683, 8436.409451338408, 8387.329013678922, 8395.496270223744, 8401.95799021007, 8402.0, 8423.410361274651, 8544.273736732384, 8587.570621468902, 8606.010308814504, 8653.567321633893, 8666.610002549838, 39206.41190382146, 39745.60254397448, 39819.40270895939, 39868.60131398707, 40002.399964000564, 2931.912042638703, 3031.4998025325795, 3225.0, 3352.6312105668358, 3389.881354152593, 29053.56419653707, 29575.26061848471, 29746.85126574375, 29773.10680679583, 29821.850890745623, 3686.6681998619983, 3687.11509237781, 3721.3859713147567, 3729.664330210294, 3806.352920003606, 262815.0, 265240.0, 265319.0, 266093.0, 266362.0, 39621.0, 39876.80369588917, 39898.40152397716, 40112.0, 48587.5141248583, 38635.22729545394, 38738.612613874066, 38780.80609596991, 38841.0, 39137.0, 14043.36804843764, 14191.077579957477, 14281.14313141215, 14283.857161428461, 14291.85708142926, 10748.89251107479, 10774.19193560486, 10835.241533092609, 10851.945740271405, 10965.945170274097, 13798.586042418743, 13839.792403113961, 13962.162270263816, 13964.441422343196, 13974.161550307013, 5771.6248443851855, 5808.88382232353, 5830.067189249699, 5836.739180398333, 5862.355140934494, 956.2397893674546, 960.5341409416427, 967.7725734452398, 1021.9933365634844, 1056.3767377247461, 27582.86208568944, 30374.696253037186, 31931.840340798146, 32293.677063229068, 32561.0, 1027.429776474049, 1038.522279751323, 1054.5570860238718, 1067.9572817087385, 1103.4979084516526, 13175.0, 15429.30568124437, 15878.841211587736, 16176.191190440431, 16443.177841107896, 376673.0, 378009.0, 379286.0, 380308.0, 382769.0, 53992.460075399526, 54517.1822422664, 54523.45476545263, 54708.0, 54879.451205488236, 1318.6241921052454, 1339.9732005360033, 1349.527665317131, 1351.9121257118256, 1353.7833946568699, 28557.143285701462, 29210.56184157197, 29234.269143270736, 29293.414131717673, 29403.0, 44204.77897610491, 44577.55422445864, 44620.55379446294, 44974.0, 45103.0, 300442.0, 302178.0, 302955.0, 303061.0, 303807.0, 31625.20936976594, 41008.38487422751, 41466.170676585694, 41637.37543936904, 42222.0, 37629.247415052094, 38358.2328353437, 38791.0, 39001.414978774774, 39165.41251881281, 32082.518762219053, 33122.83438582792, 35174.0, 35395.64604353924, 35729.64270357367, 34721.479177811845, 35244.29511409809, 35354.29291414209, 35371.82314088413, 35695.82152089223, 34532.745541919736, 34918.0, 35087.12282192965, 35091.82454087713, 35444.291114178086, 31684.841575792896, 32118.678813212504, 32435.269943956748, 32584.83707581447, 32653.0, 24877.652117953214, 24877.751222487543, 24952.500949981262, 24952.875235623706, 25286.24141275765], "unit": "score", "name": "ext.html", "value": 17564.06522347217}, {"lowerIsBetter": false, "replicates": [348.8813803306876, 356.060001595787, 356.2678695281197, 357.9552555930507, 358.47662412877196, 13459.192448453075, 13895.930520347409, 15980.360785568579, 16039.51881443557, 16455.917720411395, 16075.919620401912, 16280.4301849435, 17055.658886822257, 17101.0, 17265.568360790985, 5133.3326667533165, 5364.839054828341, 5402.270693456372, 5421.430749771276, 5427.348718153808, 5269.604779641542, 6065.363136870631, 6234.563580549363, 6244.843878903041, 6264.404881536247, 6239.908016097187, 6300.747970081191, 6694.631795251259, 6755.459563234954, 6779.35596118368, 6558.409743123142, 6692.866142677168, 6714.731410743564, 6753.561018533779, 6834.384905358516, 5991.490723288525, 6474.643894585796, 6509.121268628722, 6509.1863517060365, 6519.022146678036, 22096.116155353768, 22332.553348933092, 22363.55272894549, 22443.102275908943, 22503.324900253017, 2246.4383904023994, 2247.3482690019873, 2278.6695929090356, 2289.645105008726, 2449.6080627099755, 13316.267605281706, 13321.666958326023, 13743.244121573309, 13840.377183026789, 14084.2957852107, 1897.3169658922777, 1963.6465436221474, 2004.9398518044482, 2008.4275981345393, 2008.5982803439224, 62313.0, 64161.358386416, 64189.67905160444, 64472.0, 65996.34003659998, 14348.139111653334, 15217.695646087017, 15514.301856416489, 15535.067895926055, 15547.766783498031, 23256.65115023276, 23323.0, 23372.181973630843, 23599.17402890925, 23658.645120322864, 8750.562471876381, 9158.67944621935, 9187.310951678652, 9232.538373081454, 9269.95365023184, 7806.0, 7865.292123708894, 7868.0951690555175, 7902.0, 7915.643796029192, 4262.722923009995, 4404.471463424409, 4433.091216300651, 4447.510773814878, 7513.39892808574, 1851.787044489874, 1858.3774435563967, 1874.062968515742, 1879.9718004229946, 1883.7551118354527, 816.3632366753941, 909.4497828813472, 945.2343601682659, 946.6213514594217, 984.1536278800226, 15544.378224870878, 16003.959742616693, 16022.19889005545, 16151.434699785686, 16280.837191628169, 858.2533196119416, 880.801819590587, 913.3058875254721, 917.5549858318843, 998.5805961496189, 8649.1350864913, 8669.219770220585, 8712.477251364939, 8742.994555626057, 8902.287816974756, 519418.0, 531027.0, 531537.0, 532314.0, 545561.0, 72054.63972680208, 72497.0, 73765.88575256718, 74479.8072212067, 76061.23938760652, 1184.9822252666218, 1188.2454641302663, 1229.674136353867, 1247.8440194975628, 1260.338322380739, 9778.119969202806, 9796.608135674778, 10123.544440500342, 10233.692989210336, 14061.929690351482, 32338.514922275714, 33332.0, 35175.64824351724, 35285.29429411346, 36218.63781362153, 45125.54874451345, 46593.301100482844, 47229.527704723885, 48282.03435931332, 50032.74983625059, 9780.41317520951, 10551.997560231766, 10616.0, 10718.571257149626, 10733.892661073289, 11052.131753886075, 11133.721656958642, 11629.069674426195, 11690.357030363071, 11823.586174483851, 9294.488803115893, 9401.059894010545, 9426.198773104088, 9446.811063778823, 9555.761105972128, 6936.0, 7617.27635874591, 7719.228077192236, 7978.321842643209, 10044.899551004397, 6562.245341785565, 7097.112860892388, 7136.964315178391, 7227.8554428912175, 7262.9273707264365, 10109.39343639384, 10308.639197628047, 10328.741781455523, 10451.16390688728, 10498.94750526273, 9768.169705575106, 9898.653547126105, 9924.900750992398, 9958.751031224278, 10015.098641122335], "unit": "score", "name": "jquery.html", "value": 8835.64973674184}, {"lowerIsBetter": false, "replicates": [1478.2460944918091, 1498.7077519883624, 1659.9336026558938, 1771.4154329071391, 1794.46166150155, 6687.264400915896, 6847.109875716163, 7306.561606303626, 7477.14012888518, 7492.063492063492, 6970.442364610832, 7156.964215178929, 7183.784486465402, 7226.421886249101, 7256.8911466328045, 2267.5351552931693, 2299.4481324482085, 2307.711536057993, 2309.2494939144763, 2312.1329501436962, 2238.4963383238724, 2247.9887600562056, 2275.6017696902977, 2275.772422757719, 2291.702078729763, 2285.9771402285933, 2319.5592837360846, 2319.9304020879317, 2320.153144102399, 2331.5220379822094, 2272.1479445208047, 2273.181654604341, 2281.3042022183226, 2284.805791507724, 2296.4488522754586, 2278.1456953642382, 2296.908123675051, 2298.954020919572, 2301.1945818963395, 2304.8847557622053, 7678.769636910902, 7701.114371847198, 7720.34377077949, 7722.26249093955, 7727.806804829925, 4677.345171675968, 4721.763911804431, 4736.928946065812, 4743.7628118594275, 4776.188048031843, 2975.7619390448926, 2991.222282206642, 3052.4963381042103, 3074.047045415928, 3075.3080556874747, 921.9078092190795, 922.3220932614523, 925.7685578605349, 933.4819175357674, 975.6341371985505, 10366.740831479197, 10394.0, 10409.479526023744, 10454.268201225841, 10463.215258855616, 4325.697201195886, 4348.499922508889, 4366.061296821199, 4394.231009573312, 4410.558944105564, 8923.955380223188, 8959.910400896038, 9007.594658240396, 9018.098190181061, 9019.052999435096, 4780.354652121989, 4824.107540105092, 4833.879153021132, 4836.347093142381, 4850.708957462563, 3890.6109389060866, 3931.0761970936805, 4211.241976444269, 4384.539623339503, 4386.561343865652, 3624.5831729350934, 3631.8365673544754, 3642.125889786485, 3649.8905032849057, 3672.540932383452, 1155.6879642496478, 1161.5179700424399, 1225.8957988570894, 1228.705110773408, 1249.1131296779388, 1298.5000774701807, 1299.4087690100982, 1320.320035181882, 1328.2163523520976, 1330.2218202351733, 6859.07402500666, 6924.58452492852, 7143.285671432815, 7171.641417929082, 7177.641117944082, 476.8712447639118, 487.18639871414115, 491.29008582597805, 491.3808601162561, 494.48820470812535, 5399.109146990702, 5399.784008639689, 5434.945650543444, 5456.809011684572, 5489.176623506506, 8805.0, 8865.64537418509, 9089.0, 9179.265658747285, 9266.675666351646, 9068.8639670405, 9129.863052054225, 9130.406523575946, 9143.405678630868, 9150.679726209552, 7048.577085374894, 7140.750073747394, 7143.964280178566, 7175.354218120498, 7273.563586184846, 6836.213835408793, 6858.622775747382, 6861.416779573792, 6868.931310686829, 6884.759033433806, 7874.488158269694, 8136.918630813853, 8166.5916704163365, 8210.753677389448, 8296.377771667028, 8221.506709597443, 8288.58557072156, 8308.0, 8315.417920745489, 8393.24460798531, 6380.074889141141, 6389.2971773105855, 6447.3552644735155, 6456.806295811133, 6497.772577959749, 7185.892211616934, 7193.136823581203, 7195.71217151329, 7248.746293879689, 7261.745838895613, 6712.664366781543, 6817.522773405814, 6839.110915581142, 6941.652917354213, 7004.859902802017, 6726.8654626908165, 6742.056112144206, 6792.66036698173, 6838.350356716104, 6861.828454288683, 6707.865842683216, 6769.424598908951, 6816.829579260559, 6836.248012718696, 6839.487038472035, 5899.4985426239255, 5956.285245770535, 5957.493613042767, 5965.850853728692, 5997.880042399041, 6379.9681001596555, 6385.457236134795, 6402.775902843378, 6432.131662225727, 6437.227532696106], "unit": "score", "name": "mootools.html", "value": 4319.856094760422}, {"lowerIsBetter": false, "replicates": [315.68904628940487, 338.9186595217148, 341.06207928197455, 344.3766782124354, 345.45073333399876, 6238.750449982007, 6254.343293954132, 6254.718537665804, 6345.650989195592, 6494.5778524396, 6208.720607572659, 6209.720562574684, 6219.067139929013, 6251.3123556408755, 6281.309056003847, 4699.78850951708, 4701.200795864711, 4704.506026867181, 4713.340132381478, 4717.198076327033, 4715.0, 4716.4340279166545, 4720.433547974248, 4724.503927087658, 4730.385049943519, 4509.864704058883, 4590.495045544987, 4615.676902616819, 4628.120657075162, 4632.837850675227, 4592.242280023792, 4597.885052873671, 4609.400777898885, 4613.884652883671, 4616.099860527199, 3937.1338305572726, 3964.790738824657, 3978.124812541236, 4001.659858911996, 4016.698747593913, 5871.324797648283, 5915.792947246869, 5918.171455996164, 5924.052151655757, 5953.910691339634, 5236.371635403738, 5340.145576707708, 5390.353157621111, 5406.864828379283, 5408.053590621665, 6545.770898018546, 6598.901016484757, 6629.436497897685, 6640.501962352794, 6674.399304062657, 4494.325851122325, 4500.077484115748, 4513.571210734975, 4519.141363141026, 4522.7964741586375, 6750.953602191668, 6858.725650973955, 6896.896546551806, 6909.447244220451, 6933.895991560131, 4572.359869618256, 4603.861884143481, 4625.653076019312, 4628.236341003764, 4632.258838585877, 4666.160091183551, 4671.369365135731, 4674.579287864109, 4676.719396836133, 4682.391289132391, 5400.351957765093, 5435.619506634498, 5435.619506634576, 5440.510354068074, 5452.645578037414, 6474.15835941334, 6587.63767992765, 6630.502712296597, 6644.933550664528, 6651.0, 1614.7577863320596, 1644.7286197777232, 1653.115583163026, 1653.3469279634478, 1654.1729135432283, 1089.9618513351995, 1090.3076546393097, 1094.529352378469, 1116.2632662442911, 1117.1621284036971, 6289.8742025159245, 6291.874162516724, 6303.369663033752, 6303.873922521524, 6325.715342809584, 6781.6609169541325, 6800.93199068003, 6811.114555107804, 6821.317868213139, 6844.315568443216, 6232.439080482778, 6278.905816412757, 6311.368863113744, 6403.359664033653, 6416.486681065504, 3697.759645623026, 3704.148045949393, 3717.683996860243, 3720.981395093007, 3746.3631182699005, 7185.2814718527725, 7205.423566114699, 7247.673854676552, 7251.56490610565, 7270.309320614533, 6974.674811785744, 7062.788116356517, 7122.109736282965, 7132.964335178291, 7138.750143744944, 7213.242609525924, 7241.167265764399, 7255.709771609077, 7257.383122434652, 7270.382017528464, 6864.4165245954655, 6888.896666550106, 6899.448044156556, 6904.689288981907, 6905.067815844796, 6730.226024007106, 6821.3519715626935, 6831.521793474409, 6845.007473916155, 6857.27998560144, 7213.062301900719, 7227.566346019255, 7255.927440725525, 7270.382017528358, 7277.636118193963, 4554.089182163514, 4577.153226653079, 4595.0809838031855, 4612.054528821516, 4616.930746038879, 6821.2155602106395, 6866.313368663294, 6929.272426395156, 6931.584104953719, 6935.445164386938, 6696.330366963265, 6710.865782684221, 6717.966410167918, 6739.932600674127, 6740.090087838079, 6579.440747536321, 6591.769288074895, 6661.067450556829, 6666.633335166613, 6702.631355275506, 6605.471562275103, 6611.801645950437, 6613.404793568409, 6614.536982411185, 6620.172478440195, 6752.763653272112, 6762.729490820312, 6770.289119642367, 6775.220849602161, 6778.051072849904, 6404.967975160094, 6564.6389448578875, 6575.210974683068, 6582.967085164543, 6588.0], "unit": "score", "name": "prototype.html", "value": 4973.170093973946}, {"lowerIsBetter": false, "replicates": [649.5388274325229, 660.4155322539551, 694.6769752065288, 710.3732452683349, 748.6967778049892, 13288.202707837525, 13567.389467473962, 13603.591892243223, 13609.38757755901, 13630.522931697393, 12679.0, 12722.427490762915, 12752.744945101093, 12816.0, 12824.487020519167, 802.7752229375754, 835.031363618203, 836.2431999040878, 836.4521238588734, 837.4054421360811, 810.9918900811005, 816.8897198878135, 822.8313195794848, 826.6445428465757, 827.594478705436, 850.5704619167312, 852.1861622150863, 855.0722466124263, 856.9271611912994, 858.5964596639569, 851.0680804519042, 851.9105493923173, 859.9613017414231, 860.2730692564772, 860.6643409070437, 628.0108828594936, 628.6039794929166, 628.6510986402545, 629.5058379172327, 631.782035197856, 13500.0, 13550.119242249222, 13554.864451355557, 13565.660858478617, 13617.523386681418, 11727.413629318586, 11903.583374581847, 11939.88060119405, 12011.819822702666, 12137.635870923887, 9617.0, 9770.218382529452, 9790.755231119208, 9897.4556399398, 10110.848337274947, 3390.55922730046, 3406.199543107368, 3456.1705190754287, 3482.9825850870584, 3505.3164632896596, 46014.76992615049, 46069.5393046072, 46396.0, 46552.53447465516, 46661.366852160354, 9051.683191088281, 9092.636294548276, 9102.180803727697, 9110.271178305853, 9188.081191880892, 15879.28543215558, 15950.441734539236, 15981.840181598036, 16052.919735401481, 16155.11146886909, 6747.730090796412, 6929.5842249465195, 6989.0, 7143.24995875436, 7180.712771489082, 4019.517657881073, 4029.073313137995, 4074.103697186614, 4093.672506199497, 4103.261412945699, 2871.239121632769, 2875.0368626510353, 2883.452144092658, 2885.422915416925, 2887.6823549409546, 541.2665837789817, 556.6715637773733, 560.5851669764345, 565.0507147991332, 568.590614757374, 543.6411968101035, 609.472806022787, 614.3978900677362, 640.8045546108389, 648.2124219073847, 7923.524588524707, 8010.719624813103, 8208.507489550646, 8218.260356567938, 8339.166083391612, 522.8588281164065, 607.0711810929197, 631.5642902609789, 645.2289514030688, 699.1121275979477, 3878.7090968176935, 3918.529776426847, 3920.2159568086495, 3957.6240257175523, 4013.0970531630733, 48802.267965980536, 48834.755826220644, 49081.75459122753, 49363.753181234584, 49397.0, 48493.515064849606, 48818.5118148814, 53410.0, 54918.17622735662, 55621.72189139109, 43138.35292470615, 43544.56455435405, 43624.3456348155, 43858.0, 44751.55248447474, 8351.624176911931, 8374.0, 8422.536760478233, 8507.95746021266, 8613.09562495929, 31832.36335273235, 32328.83835580807, 32994.0, 33043.66956330406, 33326.66673333236, 37555.81222093872, 37654.62345376511, 40664.59335406608, 40750.59249407468, 41470.377944330256, 10676.733081673021, 10724.463776811284, 10747.0, 10856.511456984612, 10909.945450272699, 11150.832737509107, 11173.273737207055, 11509.251898626562, 12034.879651203375, 12106.334151621746, 10778.946105269424, 10833.241673083125, 10884.346939183675, 11353.54585816558, 11475.713107172387, 10535.841962370723, 10552.525136369035, 10731.0, 11188.552457901593, 11216.327020378803, 10607.575696972035, 10682.62610808618, 10823.891761082288, 11042.447877605928, 11218.719532011764, 9062.0, 9216.314668471265, 9330.160285574331, 9557.61769529211, 9666.661666841626, 8518.23335899772, 8612.267957223707, 9367.665125198313, 9431.905680943377, 9517.55890673875], "unit": "score", "name": "yui.html", "value": 6043.6968607228655}], "name": "dromaeo_css", "value": 6874.998219420907}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 106.0, 113.0, 112.0, 112.0, 124.0, 114.0, 110.0, 114.0, 113.0], "unit": "score", "name": "ai-astar", "value": 113.0}, {"lowerIsBetter": true, "replicates": [150.0, 134.0, 153.0, 158.0, 137.0, 160.0, 156.0, 128.0, 168.0, 125.0], "unit": "score", "name": "audio-beat-detection", "value": 146.9}, {"lowerIsBetter": true, "replicates": [164.0, 162.0, 163.0, 162.0, 162.0, 162.0, 164.0, 169.0, 170.0, 164.0], "unit": "score", "name": "audio-dft", "value": 164.2}, {"lowerIsBetter": true, "replicates": [75.0, 73.0, 75.0, 74.0, 73.0, 139.0, 76.0, 76.0, 73.0, 76.0], "unit": "score", "name": "audio-fft", "value": 81.0}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 135.0, 95.0, 95.0, 96.0, 138.0, 95.0, 96.0, 132.0], "unit": "score", "name": "audio-oscillator", "value": 107.2}, {"lowerIsBetter": true, "replicates": [118.0, 115.0, 115.0, 115.0, 115.0, 115.0, 115.0, 115.0, 115.0, 115.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.3}, {"lowerIsBetter": true, "replicates": [147.0, 147.0, 146.0, 146.0, 148.0, 147.0, 146.0, 146.0, 147.0, 148.0], "unit": "score", "name": "imaging-darkroom", "value": 146.8}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 97.0, 97.0, 98.0, 97.0, 96.0, 96.0, 97.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.6}, {"lowerIsBetter": true, "replicates": [59.0, 61.0, 59.0, 58.0, 58.0, 57.0, 58.0, 59.0, 58.0, 56.0], "unit": "score", "name": "json-parse-financial", "value": 58.3}, {"lowerIsBetter": true, "replicates": [66.0, 66.0, 68.0, 67.0, 68.0, 67.0, 66.0, 67.0, 68.0, 66.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 66.9}, {"lowerIsBetter": true, "replicates": [85.0, 85.0, 85.0, 92.0, 85.0, 84.0, 92.0, 84.0, 97.0, 86.0], "unit": "score", "name": "stanford-crypto-aes", "value": 87.5}, {"lowerIsBetter": true, "replicates": [120.0, 120.0, 129.0, 130.0, 137.0, 115.0, 124.0, 129.0, 116.0, 115.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 123.5}, {"lowerIsBetter": true, "replicates": [143.0, 167.0, 151.0, 152.0, 142.0, 149.0, 153.0, 154.0, 150.0, 139.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 150.0}, {"lowerIsBetter": true, "replicates": [70.0, 71.0, 72.0, 72.0, 69.0, 69.0, 68.0, 67.0, 72.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 69.7}], "name": "kraken", "value": 1526.9}]} 16:30:01 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,1,43]]", "result": "1526.90"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,1,43]]", "result": "6875.00"}}} 16:30:01 INFO - Return code: 0 16:30:01 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 16:30:01 INFO - # TBPL SUCCESS # 16:30:01 INFO - Running post-action listener: _resource_record_post_action 16:30:01 INFO - Running post-run listener: _resource_record_post_run 16:30:02 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 0; Write bytes: 535121920; Read time: 0; Write time: 496948 16:30:02 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 243552256; Read time: 0; Write time: 267192 16:30:02 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 0; Write bytes: 291569664; Read time: 0; Write time: 229756 16:30:02 INFO - Running post-run listener: _upload_blobber_files 16:30:02 INFO - Blob upload gear active. 16:30:02 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 16:30:02 INFO - Files from /builds/slave/test-pgo/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 16:30:02 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 16:30:02 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Firefox -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 16:30:03 INFO - (blobuploader) - INFO - Open directory for files ... 16:30:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 16:30:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:30:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:30:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 16:30:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:30:04 INFO - (blobuploader) - INFO - Done attempting. 16:30:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 16:30:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:30:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:30:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 16:30:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:30:05 INFO - (blobuploader) - INFO - Done attempting. 16:30:05 INFO - (blobuploader) - INFO - Iteration through files over. 16:30:05 INFO - Return code: 0 16:30:05 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 16:30:05 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 16:30:05 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b2d2634b5ce90a0d5bf647f030dcda56cfb1a19747919a9114e50bcfec47f70712eadd71cf630b5f223a74f9c74577fcdb4d383cae9295bc45021e2971cf33d3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/62508225eee18531a471afcb2c67654b112b74231a017c3c42b68167c25f82a6679bfd3240d7636e73809a2262d34f2dc7215099cfc57d257d9c1444ce81193d"} 16:30:05 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 16:30:05 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 16:30:05 INFO - Contents: 16:30:05 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b2d2634b5ce90a0d5bf647f030dcda56cfb1a19747919a9114e50bcfec47f70712eadd71cf630b5f223a74f9c74577fcdb4d383cae9295bc45021e2971cf33d3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/62508225eee18531a471afcb2c67654b112b74231a017c3c42b68167c25f82a6679bfd3240d7636e73809a2262d34f2dc7215099cfc57d257d9c1444ce81193d"} 16:30:05 INFO - Running post-run listener: copy_logs_to_upload_dir 16:30:05 INFO - Copying logs to upload dir... 16:30:05 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 16:30:05 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1253.278413 ========= master_lag: 14.16 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2016-01-29 16:30:18.778177) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-29 16:30:18.782890) ========= 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=e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b2d2634b5ce90a0d5bf647f030dcda56cfb1a19747919a9114e50bcfec47f70712eadd71cf630b5f223a74f9c74577fcdb4d383cae9295bc45021e2971cf33d3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/62508225eee18531a471afcb2c67654b112b74231a017c3c42b68167c25f82a6679bfd3240d7636e73809a2262d34f2dc7215099cfc57d257d9c1444ce81193d"} build_url:https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011375 build_url: 'https://queue.taskcluster.net/v1/task/AGd4tfcHRYufl53C0-0xkw/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b2d2634b5ce90a0d5bf647f030dcda56cfb1a19747919a9114e50bcfec47f70712eadd71cf630b5f223a74f9c74577fcdb4d383cae9295bc45021e2971cf33d3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/62508225eee18531a471afcb2c67654b112b74231a017c3c42b68167c25f82a6679bfd3240d7636e73809a2262d34f2dc7215099cfc57d257d9c1444ce81193d"}' ========= master_lag: 0.27 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-29 16:30:19.064188) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-29 16:30:19.064579) ========= 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=e31afd3c0f0de4e86ebe4d94000001b5-1454112284.144928-1124785186 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004673 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-29 16:30:19.116757) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-29 16:30:19.117171) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-29 16:30:19.123863) ========= ========= Total master_lag: 14.67 =========