builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-005 starttime: 1454339480.63 results: success (0) buildid: 20160201043002 builduid: 86fbebd8c2f84110be35f5a967072aa1 revision: 4d224eb479016d230706363d36c415c2f4960e75 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.629804) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.630342) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.630644) ========= 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=7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006323 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.655581) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.655889) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.676676) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.677034) ========= 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=7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004587 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.725696) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.725963) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.726316) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.726585) ========= 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=7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-01 07:11:21-- 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% 217M=0s 2016-02-01 07:11:21 (217 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.116745 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.855636) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.855942) ========= 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=7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021779 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.906125) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:20.906508) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 4d224eb479016d230706363d36c415c2f4960e75 --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 4d224eb479016d230706363d36c415c2f4960e75 --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=7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-01 07:11:21,881 truncating revision to first 12 chars 2016-02-01 07:11:21,881 Setting DEBUG logging. 2016-02-01 07:11:21,881 attempt 1/10 2016-02-01 07:11:21,881 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/4d224eb47901?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-01 07:11:22,121 unpacking tar archive at: mozilla-central-4d224eb47901/testing/mozharness/ program finished with exit code 0 elapsedTime=0.508641 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:21.450845) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:21.451144) ========= echo 4d224eb479016d230706363d36c415c2f4960e75 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'4d224eb479016d230706363d36c415c2f4960e75'] 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=7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 4d224eb479016d230706363d36c415c2f4960e75 program finished with exit code 0 elapsedTime=0.004653 script_repo_revision: '4d224eb479016d230706363d36c415c2f4960e75' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:21.503741) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:21.504027) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-01 07:11:21.516153) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 30 secs) (at 2016-02-01 07:11:21.516430) ========= /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=7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:11:22 INFO - MultiFileLogger online at 20160201 07:11:22 in /builds/slave/test-pgo 07:11:22 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 07:11:22 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 07:11:22 INFO - {'append_to_log': False, 07:11:22 INFO - 'base_work_dir': '/builds/slave/test-pgo', 07:11:22 INFO - 'blob_upload_branch': 'Firefox', 07:11:22 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 07:11:22 INFO - 'branch': 'Firefox', 07:11:22 INFO - 'buildbot_json_path': 'buildprops.json', 07:11:22 INFO - 'config_files': ('talos/linux_config.py',), 07:11:22 INFO - 'default_actions': ('clobber', 07:11:22 INFO - 'read-buildbot-config', 07:11:22 INFO - 'download-and-extract', 07:11:22 INFO - 'populate-webroot', 07:11:22 INFO - 'create-virtualenv', 07:11:22 INFO - 'install', 07:11:22 INFO - 'run-tests'), 07:11:22 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:11:22 INFO - 'download_minidump_stackwalk': True, 07:11:22 INFO - 'download_symbols': 'ondemand', 07:11:22 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:11:22 INFO - 'tooltool.py': '/tools/tooltool.py', 07:11:22 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:11:22 INFO - '/tools/misc-python/virtualenv.py')}, 07:11:22 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:11:22 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:11:22 INFO - 'installer_path': 'installer.exe', 07:11:22 INFO - 'log_level': 'info', 07:11:22 INFO - 'log_name': 'talos', 07:11:22 INFO - 'log_to_console': True, 07:11:22 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:11:22 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:11:22 INFO - 'opt_config_files': (), 07:11:22 INFO - 'pip_index': False, 07:11:22 INFO - 'sps_profile': False, 07:11:22 INFO - 'sps_profile_interval': 0, 07:11:22 INFO - 'suite': 'dromaeojs-e10s', 07:11:22 INFO - 'system_bits': '32', 07:11:22 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:11:22 INFO - 'title': 'talos-linux64-ix-005', 07:11:22 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:11:22 INFO - 'use_talos_json': True, 07:11:22 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 07:11:22 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:11:22 INFO - 'work_dir': 'build'} 07:11:22 INFO - ##### 07:11:22 INFO - ##### Running clobber step. 07:11:22 INFO - ##### 07:11:22 INFO - Running pre-action listener: _resource_record_pre_action 07:11:22 INFO - Running main action method: clobber 07:11:22 INFO - rmtree: /builds/slave/test-pgo/build 07:11:22 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 07:11:23 INFO - Running post-action listener: _resource_record_post_action 07:11:23 INFO - ##### 07:11:23 INFO - ##### Running read-buildbot-config step. 07:11:23 INFO - ##### 07:11:23 INFO - Running pre-action listener: _resource_record_pre_action 07:11:23 INFO - Running main action method: read_buildbot_config 07:11:23 INFO - Using buildbot properties: 07:11:23 INFO - { 07:11:23 INFO - "project": "", 07:11:23 INFO - "product": "firefox", 07:11:23 INFO - "script_repo_revision": "production", 07:11:23 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 07:11:23 INFO - "repository": "", 07:11:23 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs-e10s", 07:11:23 INFO - "buildid": "20160201043002", 07:11:23 INFO - "pgo_build": "True", 07:11:23 INFO - "basedir": "/builds/slave/test-pgo", 07:11:23 INFO - "buildnumber": 93, 07:11:23 INFO - "slavename": "talos-linux64-ix-005", 07:11:23 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 07:11:23 INFO - "platform": "ubuntu64_hw", 07:11:23 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 07:11:23 INFO - "branch": "mozilla-central", 07:11:23 INFO - "repo_path": "mozilla-central", 07:11:23 INFO - "revision": "4d224eb479016d230706363d36c415c2f4960e75", 07:11:23 INFO - "stage_platform": "linux64-pgo", 07:11:23 INFO - "builduid": "86fbebd8c2f84110be35f5a967072aa1", 07:11:23 INFO - "slavebuilddir": "test" 07:11:23 INFO - } 07:11:23 INFO - Found installer url https://queue.taskcluster.net/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 07:11:23 INFO - Running post-action listener: _resource_record_post_action 07:11:23 INFO - ##### 07:11:23 INFO - ##### Running download-and-extract step. 07:11:23 INFO - ##### 07:11:23 INFO - Running pre-action listener: _resource_record_pre_action 07:11:23 INFO - Running main action method: download_and_extract 07:11:23 INFO - mkdir: /builds/slave/test-pgo/build/tests 07:11:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:23 INFO - https://queue.taskcluster.net/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 07:11:23 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/test_packages.json 07:11:23 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/test_packages.json 07:11:23 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 07:11:23 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 07:11:24 INFO - Downloaded 1448 bytes. 07:11:24 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 07:11:24 INFO - Using the following test package requirements: 07:11:24 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 07:11:24 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:11:24 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 07:11:24 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:11:24 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 07:11:24 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:11:24 INFO - u'jsshell-linux-x86_64.zip'], 07:11:24 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:11:24 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 07:11:24 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 07:11:24 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:11:24 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 07:11:24 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:11:24 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 07:11:24 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:11:24 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 07:11:24 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 07:11:24 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 07:11:24 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 07:11:24 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 07:11:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:24 INFO - https://queue.taskcluster.net/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:11:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 07:11:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 07:11:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/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 07:11:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/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 07:11:26 INFO - Downloaded 22935627 bytes. 07:11:26 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'] 07:11:26 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 07:11:28 INFO - Return code: 0 07:11:28 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 07:11:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:28 INFO - https://queue.taskcluster.net/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:11:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 07:11:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 07:11:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/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 07:11:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/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 07:11:39 INFO - Downloaded 22935627 bytes. 07:11:39 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'] 07:11:39 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 07:11:40 INFO - Return code: 0 07:11:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:40 INFO - https://queue.taskcluster.net/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 07:11:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 07:11:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 07:11:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/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 07:11:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/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 07:11:44 INFO - Downloaded 10706582 bytes. 07:11:44 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'] 07:11:44 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 07:11:44 INFO - Return code: 0 07:11:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:44 INFO - https://queue.taskcluster.net/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 07:11:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 07:11:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 07:11:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/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 07:11:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ZkTKYEihQ6eEP4InrhRwKg/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 07:11:46 INFO - Downloaded 56073802 bytes. 07:11:46 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 07:11:46 INFO - mkdir: /builds/slave/test-pgo/properties 07:11:46 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 07:11:46 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 07:11:46 INFO - Contents: 07:11:46 INFO - build_url:https://queue.taskcluster.net/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 07:11:46 INFO - Running post-action listener: _resource_record_post_action 07:11:46 INFO - Running post-action listener: set_extra_try_arguments 07:11:46 INFO - ##### 07:11:46 INFO - ##### Running populate-webroot step. 07:11:46 INFO - ##### 07:11:46 INFO - Running pre-action listener: _resource_record_pre_action 07:11:46 INFO - Running main action method: populate_webroot 07:11:46 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:11:46 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:11:46 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:11:46 INFO - '--tppagecycles', 07:11:46 INFO - '7'], 07:11:46 INFO - 'tests': ['tsvgm']}}, 07:11:46 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 07:11:46 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 07:11:46 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:11:46 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 07:11:46 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 07:11:46 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:11:46 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:11:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:11:46 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:11:46 INFO - 'talos_options': ['--e10s'], 07:11:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:11:46 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:11:46 INFO - 'tests': ['damp', 'tps']}, 07:11:46 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:11:46 INFO - 'talos_options': ['--e10s'], 07:11:46 INFO - 'tests': ['damp', 'tps']}, 07:11:46 INFO - 'g3': {'tests': ['dromaeo_dom']}, 07:11:46 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:11:46 INFO - 'other': {'tests': ['a11yr', 07:11:46 INFO - 'ts_paint', 07:11:46 INFO - 'tpaint', 07:11:46 INFO - 'sessionrestore', 07:11:46 INFO - 'sessionrestore_no_auto_restore']}, 07:11:46 INFO - 'other-e10s': {'talos_options': ['--e10s'], 07:11:46 INFO - 'tests': ['a11yr', 07:11:46 INFO - 'ts_paint', 07:11:46 INFO - 'tpaint', 07:11:46 INFO - 'sessionrestore', 07:11:46 INFO - 'sessionrestore_no_auto_restore']}, 07:11:46 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 07:11:46 INFO - 'tests': ['a11yr', 07:11:46 INFO - 'ts_paint', 07:11:46 INFO - 'tpaint', 07:11:46 INFO - 'sessionrestore', 07:11:46 INFO - 'sessionrestore_no_auto_restore']}, 07:11:46 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 07:11:46 INFO - 'tests': ['a11yr', 07:11:46 INFO - 'ts_paint', 07:11:46 INFO - 'tpaint', 07:11:46 INFO - 'sessionrestore', 07:11:46 INFO - 'sessionrestore_no_auto_restore']}, 07:11:46 INFO - 'other_l64': {'tests': ['a11yr', 07:11:46 INFO - 'ts_paint', 07:11:46 INFO - 'tpaint', 07:11:46 INFO - 'sessionrestore', 07:11:46 INFO - 'sessionrestore_no_auto_restore']}, 07:11:46 INFO - 'other_nol64': {'tests': ['a11yr', 07:11:46 INFO - 'ts_paint', 07:11:46 INFO - 'tpaint', 07:11:46 INFO - 'sessionrestore', 07:11:46 INFO - 'sessionrestore_no_auto_restore']}, 07:11:46 INFO - 'svgr': {'tests': ['tsvgx', 07:11:46 INFO - 'tsvgr_opacity', 07:11:46 INFO - 'tart', 07:11:46 INFO - 'tscrollx', 07:11:46 INFO - 'cart']}, 07:11:46 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 07:11:46 INFO - 'tests': ['tsvgx', 07:11:46 INFO - 'tsvgr_opacity', 07:11:46 INFO - 'tart', 07:11:46 INFO - 'tscrollx', 07:11:46 INFO - 'cart']}, 07:11:46 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:11:46 INFO - 'tests': ['tp5o']}, 07:11:46 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:11:46 INFO - 'talos_options': ['--e10s'], 07:11:46 INFO - 'tests': ['tp5o']}, 07:11:46 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:11:46 INFO - 'talos_options': ['--xperf_path', 07:11:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:11:46 INFO - 'tests': ['tp5n']}, 07:11:46 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:11:46 INFO - 'talos_options': ['--e10s', 07:11:46 INFO - '--xperf_path', 07:11:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:11:46 INFO - 'tests': ['tp5n']}}, 07:11:46 INFO - 'talos.zip': {'path': '', 07:11:46 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:11:46 INFO - Running post-action listener: _resource_record_post_action 07:11:46 INFO - ##### 07:11:46 INFO - ##### Running create-virtualenv step. 07:11:46 INFO - ##### 07:11:46 INFO - Running pre-action listener: _resource_record_pre_action 07:11:46 INFO - Running main action method: create_virtualenv 07:11:46 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 07:11:46 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 07:11:46 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 07:11:46 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:11:46 INFO - Using real prefix '/usr' 07:11:46 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 07:11:47 INFO - Installing distribute.............................................................................................................................................................................................done. 07:11:49 INFO - Installing pip.................done. 07:11:49 INFO - Return code: 0 07:11:49 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 07:11:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:11:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:11:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:49 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 0x7f8242e35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfaa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110b840>, '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 0x10786b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078b60>, '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': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', '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 07:11:49 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 07:11:49 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 07:11:49 INFO - Using env: {'DISPLAY': ':0', 07:11:49 INFO - 'HOME': '/home/cltbld', 07:11:49 INFO - 'LANG': 'en_US.UTF-8', 07:11:49 INFO - 'LANGUAGE': 'en_US:en', 07:11:49 INFO - 'LOGNAME': 'cltbld', 07:11:49 INFO - 'MAIL': '/var/mail/cltbld', 07:11:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:11:49 INFO - 'MOZ_NO_REMOTE': '1', 07:11:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:11:49 INFO - 'NO_EM_RESTART': '1', 07:11:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:11:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:11:49 INFO - 'PWD': '/builds/slave/test-pgo', 07:11:49 INFO - 'SHELL': '/bin/bash', 07:11:49 INFO - 'SHLVL': '1', 07:11:49 INFO - 'TERM': 'linux', 07:11:49 INFO - 'TMOUT': '86400', 07:11:49 INFO - 'USER': 'cltbld', 07:11:49 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', 07:11:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:11:49 INFO - '_': '/tools/buildbot/bin/python'} 07:11:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:11:49 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 07:11:49 INFO - Cleaning up... 07:11:49 INFO - Return code: 0 07:11:49 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 07:11:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:11:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:11:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:49 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 0x7f8242e35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfaa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110b840>, '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 0x10786b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078b60>, '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': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', '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 07:11:49 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 07:11:49 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 07:11:49 INFO - Using env: {'DISPLAY': ':0', 07:11:49 INFO - 'HOME': '/home/cltbld', 07:11:49 INFO - 'LANG': 'en_US.UTF-8', 07:11:49 INFO - 'LANGUAGE': 'en_US:en', 07:11:49 INFO - 'LOGNAME': 'cltbld', 07:11:49 INFO - 'MAIL': '/var/mail/cltbld', 07:11:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:11:49 INFO - 'MOZ_NO_REMOTE': '1', 07:11:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:11:49 INFO - 'NO_EM_RESTART': '1', 07:11:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:11:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:11:49 INFO - 'PWD': '/builds/slave/test-pgo', 07:11:49 INFO - 'SHELL': '/bin/bash', 07:11:49 INFO - 'SHLVL': '1', 07:11:49 INFO - 'TERM': 'linux', 07:11:49 INFO - 'TMOUT': '86400', 07:11:49 INFO - 'USER': 'cltbld', 07:11:49 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', 07:11:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:11:49 INFO - '_': '/tools/buildbot/bin/python'} 07:11:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:11:49 INFO - Downloading/unpacking psutil>=0.7.1 07:11:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:51 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 07:11:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:11:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:11:51 INFO - Installing collected packages: psutil 07:11:51 INFO - Running setup.py install for psutil 07:11:51 INFO - building 'psutil._psutil_linux' extension 07:11:51 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 07:11:51 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 07:11:52 INFO - building 'psutil._psutil_posix' extension 07:11:52 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 07:11:52 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 07:11:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:11:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:11:52 INFO - Successfully installed psutil 07:11:52 INFO - Cleaning up... 07:11:52 INFO - Return code: 0 07:11:52 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 07:11: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')]} 07:11:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:11:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11: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')]} 07:11:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:11:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11: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', '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 0x7f8242e35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfaa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110b840>, '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 0x10786b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078b60>, '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': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', '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 07:11: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', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 07:11: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 mozsystemmonitor==0.0.0 07:11:52 INFO - Using env: {'DISPLAY': ':0', 07:11:52 INFO - 'HOME': '/home/cltbld', 07:11:52 INFO - 'LANG': 'en_US.UTF-8', 07:11:52 INFO - 'LANGUAGE': 'en_US:en', 07:11:52 INFO - 'LOGNAME': 'cltbld', 07:11:52 INFO - 'MAIL': '/var/mail/cltbld', 07:11:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:11:52 INFO - 'MOZ_NO_REMOTE': '1', 07:11:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:11:52 INFO - 'NO_EM_RESTART': '1', 07:11:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:11:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:11:52 INFO - 'PWD': '/builds/slave/test-pgo', 07:11:52 INFO - 'SHELL': '/bin/bash', 07:11:52 INFO - 'SHLVL': '1', 07:11:52 INFO - 'TERM': 'linux', 07:11:52 INFO - 'TMOUT': '86400', 07:11:52 INFO - 'USER': 'cltbld', 07:11:52 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', 07:11:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:11:52 INFO - '_': '/tools/buildbot/bin/python'} 07:11:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:11:52 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 07:11: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 07:11: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 07:11: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 07:11: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 07:11: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 07:11: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 07:11:54 INFO - Downloading mozsystemmonitor-0.0.tar.gz 07:11:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:11:54 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 07:11:54 INFO - Installing collected packages: mozsystemmonitor 07:11:54 INFO - Running setup.py install for mozsystemmonitor 07:11:54 INFO - Successfully installed mozsystemmonitor 07:11:54 INFO - Cleaning up... 07:11:54 INFO - Return code: 0 07:11:54 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 07:11:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:11:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:11:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:11:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:54 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 0x7f8242e35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfaa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110b840>, '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 0x10786b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078b60>, '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': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', '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 07:11:54 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 07:11:54 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 07:11:54 INFO - Using env: {'DISPLAY': ':0', 07:11:54 INFO - 'HOME': '/home/cltbld', 07:11:54 INFO - 'LANG': 'en_US.UTF-8', 07:11:54 INFO - 'LANGUAGE': 'en_US:en', 07:11:54 INFO - 'LOGNAME': 'cltbld', 07:11:54 INFO - 'MAIL': '/var/mail/cltbld', 07:11:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:11:54 INFO - 'MOZ_NO_REMOTE': '1', 07:11:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:11:54 INFO - 'NO_EM_RESTART': '1', 07:11:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:11:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:11:54 INFO - 'PWD': '/builds/slave/test-pgo', 07:11:54 INFO - 'SHELL': '/bin/bash', 07:11:54 INFO - 'SHLVL': '1', 07:11:54 INFO - 'TERM': 'linux', 07:11:54 INFO - 'TMOUT': '86400', 07:11:54 INFO - 'USER': 'cltbld', 07:11:54 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', 07:11:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:11:54 INFO - '_': '/tools/buildbot/bin/python'} 07:11:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:11:54 INFO - Downloading/unpacking blobuploader==1.2.4 07:11:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:56 INFO - Downloading blobuploader-1.2.4.tar.gz 07:11:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:11:56 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:11:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 07:11:56 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:11:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:11:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:11:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:11:57 INFO - Downloading docopt-0.6.1.tar.gz 07:11:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 07:11:57 INFO - Installing collected packages: blobuploader, requests, docopt 07:11:57 INFO - Running setup.py install for blobuploader 07:11:57 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:11:57 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 07:11:57 INFO - Running setup.py install for requests 07:11:57 INFO - Running setup.py install for docopt 07:11:57 INFO - Successfully installed blobuploader requests docopt 07:11:57 INFO - Cleaning up... 07:11:57 INFO - Return code: 0 07:11:57 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:11: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')]} 07:11:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:11:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11: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')]} 07:11:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:11:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:11:57 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 0x7f8242e35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfaa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110b840>, '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 0x10786b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078b60>, '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': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', '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 07:11:57 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 07:11:57 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 07:11:57 INFO - Using env: {'DISPLAY': ':0', 07:11:57 INFO - 'HOME': '/home/cltbld', 07:11:57 INFO - 'LANG': 'en_US.UTF-8', 07:11:57 INFO - 'LANGUAGE': 'en_US:en', 07:11:57 INFO - 'LOGNAME': 'cltbld', 07:11:57 INFO - 'MAIL': '/var/mail/cltbld', 07:11:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:11:57 INFO - 'MOZ_NO_REMOTE': '1', 07:11:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:11:57 INFO - 'NO_EM_RESTART': '1', 07:11:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:11:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:11:57 INFO - 'PWD': '/builds/slave/test-pgo', 07:11:57 INFO - 'SHELL': '/bin/bash', 07:11:57 INFO - 'SHLVL': '1', 07:11:57 INFO - 'TERM': 'linux', 07:11:57 INFO - 'TMOUT': '86400', 07:11:57 INFO - 'USER': 'cltbld', 07:11:57 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', 07:11:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:11:57 INFO - '_': '/tools/buildbot/bin/python'} 07:11:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:11:58 INFO - Running setup.py (path:/tmp/pip-pSPjUF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:11:58 INFO - Running setup.py (path:/tmp/pip-NWweGH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:11:58 INFO - Running setup.py (path:/tmp/pip-dzSotn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:11:58 INFO - Running setup.py (path:/tmp/pip-6ALhMo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 07:11:58 INFO - Running setup.py (path:/tmp/pip-wSgJ7y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:11:58 INFO - Running setup.py (path:/tmp/pip-8ygPuh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:11:58 INFO - Running setup.py (path:/tmp/pip-RA1Wh6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:11:58 INFO - Running setup.py (path:/tmp/pip-RL0ded-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 07:11:58 INFO - Running setup.py (path:/tmp/pip-CjPyqy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 07:11:58 INFO - Running setup.py (path:/tmp/pip-45hLTy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:11:58 INFO - Running setup.py (path:/tmp/pip-aChePy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:11:58 INFO - Running setup.py (path:/tmp/pip-YUUzOe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:11:58 INFO - Running setup.py (path:/tmp/pip-wDjIQU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:11:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:11:58 INFO - Running setup.py (path:/tmp/pip-qNnyKE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:11:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:11:59 INFO - Running setup.py (path:/tmp/pip-kIFnBm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:11:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 07:11:59 INFO - Running setup.py (path:/tmp/pip-DMA4o5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 07:11:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 07:11:59 INFO - Running setup.py (path:/tmp/pip-GTsiHA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 07:11:59 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:11:59 INFO - Running setup.py install for manifestparser 07:11:59 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 07:11:59 INFO - Running setup.py install for mozcrash 07:11:59 INFO - Running setup.py install for mozdebug 07:11:59 INFO - Running setup.py install for mozdevice 07:11:59 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 07:11:59 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 07:11:59 INFO - Running setup.py install for mozfile 07:11:59 INFO - Running setup.py install for mozhttpd 07:11:59 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 07:11:59 INFO - Running setup.py install for mozinfo 07:11:59 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 07:11:59 INFO - Running setup.py install for mozInstall 07:12:00 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 07:12:00 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 07:12:00 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 07:12:00 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 07:12:00 INFO - Running setup.py install for mozleak 07:12:00 INFO - Running setup.py install for mozlog 07:12:00 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 07:12:00 INFO - Running setup.py install for moznetwork 07:12:00 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 07:12:00 INFO - Running setup.py install for mozprocess 07:12:00 INFO - Running setup.py install for mozprofile 07:12:00 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 07:12:00 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 07:12:00 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 07:12:00 INFO - Running setup.py install for mozrunner 07:12:00 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 07:12:00 INFO - Running setup.py install for mozscreenshot 07:12:00 INFO - Running setup.py install for moztest 07:12:00 INFO - Running setup.py install for mozversion 07:12:01 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 07:12:01 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:12:01 INFO - Cleaning up... 07:12:01 INFO - Return code: 0 07:12:01 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:12:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:12:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:12:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:12:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:12:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:01 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 0x7f8242e35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfaa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110b840>, '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 0x10786b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078b60>, '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': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', '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 07:12:01 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 07:12:01 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 07:12:01 INFO - Using env: {'DISPLAY': ':0', 07:12:01 INFO - 'HOME': '/home/cltbld', 07:12:01 INFO - 'LANG': 'en_US.UTF-8', 07:12:01 INFO - 'LANGUAGE': 'en_US:en', 07:12:01 INFO - 'LOGNAME': 'cltbld', 07:12:01 INFO - 'MAIL': '/var/mail/cltbld', 07:12:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:12:01 INFO - 'MOZ_NO_REMOTE': '1', 07:12:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:12:01 INFO - 'NO_EM_RESTART': '1', 07:12:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:12:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:12:01 INFO - 'PWD': '/builds/slave/test-pgo', 07:12:01 INFO - 'SHELL': '/bin/bash', 07:12:01 INFO - 'SHLVL': '1', 07:12:01 INFO - 'TERM': 'linux', 07:12:01 INFO - 'TMOUT': '86400', 07:12:01 INFO - 'USER': 'cltbld', 07:12:01 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', 07:12:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:12:01 INFO - '_': '/tools/buildbot/bin/python'} 07:12:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:12:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:12:01 INFO - Running setup.py (path:/tmp/pip-qGwCdH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:12:01 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 07:12:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:12:01 INFO - Running setup.py (path:/tmp/pip-1gUVVu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:12:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 07:12:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:12:01 INFO - Running setup.py (path:/tmp/pip-hI1tW3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:12:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 07:12:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:12:01 INFO - Running setup.py (path:/tmp/pip-r1ENHY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:12:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 07:12:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 07:12:01 INFO - Running setup.py (path:/tmp/pip-2Dc8lw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 07:12:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5)) 07:12:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:12:01 INFO - Running setup.py (path:/tmp/pip-DBQfMp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:12:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6)) 07:12:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:12:01 INFO - Running setup.py (path:/tmp/pip-rz0oqR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:12:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7)) 07:12:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:12:01 INFO - Running setup.py (path:/tmp/pip-bpvst2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:12:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8)) 07:12:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 07:12:01 INFO - Running setup.py (path:/tmp/pip-OxtuYj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 07:12:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 07:12:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 07:12:01 INFO - Running setup.py (path:/tmp/pip-F8Wo0J-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 07:12:02 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)) 07:12:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:12:02 INFO - Running setup.py (path:/tmp/pip-1SdLjn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:12:02 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)) 07:12:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:12:02 INFO - Running setup.py (path:/tmp/pip-OAIuWC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:12:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 07:12:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:12:02 INFO - Running setup.py (path:/tmp/pip-9kUAPw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:12:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13)) 07:12:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:12:02 INFO - Running setup.py (path:/tmp/pip-Iv1gcp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:12:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 07:12:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:12:02 INFO - Running setup.py (path:/tmp/pip-ukAKli-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:12:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 07:12:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 07:12:02 INFO - Running setup.py (path:/tmp/pip-5u2DRK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 07:12:02 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16)) 07:12:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 07:12:02 INFO - Running setup.py (path:/tmp/pip-kmJyKe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 07:12:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 07:12:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 07:12:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 07:12:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 07:12:02 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 07:12:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 07:12:02 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 07:12:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:12:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:12:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:12:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:12:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:12:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:12:04 INFO - Downloading blessings-1.6.tar.gz 07:12:04 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 07:12:04 INFO - Installing collected packages: blessings 07:12:04 INFO - Running setup.py install for blessings 07:12:04 INFO - Successfully installed blessings 07:12:04 INFO - Cleaning up... 07:12:04 INFO - Return code: 0 07:12:04 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 07:12:04 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 07:12:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 07:12:04 INFO - Reading from file tmpfile_stdout 07:12:04 INFO - Current package versions: 07:12:04 INFO - argparse == 1.2.1 07:12:04 INFO - blessings == 1.6 07:12:04 INFO - blobuploader == 1.2.4 07:12:04 INFO - docopt == 0.6.1 07:12:04 INFO - manifestparser == 1.1 07:12:04 INFO - mozInstall == 1.12 07:12:04 INFO - mozcrash == 0.16 07:12:04 INFO - mozdebug == 0.1 07:12:04 INFO - mozdevice == 0.48 07:12:04 INFO - mozfile == 1.2 07:12:04 INFO - mozhttpd == 0.7 07:12:04 INFO - mozinfo == 0.9 07:12:04 INFO - mozleak == 0.1 07:12:04 INFO - mozlog == 3.1 07:12:04 INFO - moznetwork == 0.27 07:12:04 INFO - mozprocess == 0.22 07:12:04 INFO - mozprofile == 0.28 07:12:04 INFO - mozrunner == 6.11 07:12:04 INFO - mozscreenshot == 0.1 07:12:04 INFO - mozsystemmonitor == 0.0 07:12:04 INFO - moztest == 0.7 07:12:04 INFO - mozversion == 1.4 07:12:04 INFO - psutil == 3.1.1 07:12:04 INFO - requests == 1.2.3 07:12:04 INFO - wsgiref == 0.1.2 07:12:04 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:12: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')]} 07:12:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:12:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12: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')]} 07:12:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:12:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12: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/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 0x7f8242e35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfaa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110b840>, '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 0x10786b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078b60>, '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': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', '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 07:12:04 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 07:12:04 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 07:12:04 INFO - Using env: {'DISPLAY': ':0', 07:12:04 INFO - 'HOME': '/home/cltbld', 07:12:04 INFO - 'LANG': 'en_US.UTF-8', 07:12:04 INFO - 'LANGUAGE': 'en_US:en', 07:12:04 INFO - 'LOGNAME': 'cltbld', 07:12:04 INFO - 'MAIL': '/var/mail/cltbld', 07:12:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:12:04 INFO - 'MOZ_NO_REMOTE': '1', 07:12:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:12:04 INFO - 'NO_EM_RESTART': '1', 07:12:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:12:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:12:04 INFO - 'PWD': '/builds/slave/test-pgo', 07:12:04 INFO - 'SHELL': '/bin/bash', 07:12:04 INFO - 'SHLVL': '1', 07:12:04 INFO - 'TERM': 'linux', 07:12:04 INFO - 'TMOUT': '86400', 07:12:04 INFO - 'USER': 'cltbld', 07:12:04 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', 07:12:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:12:04 INFO - '_': '/tools/buildbot/bin/python'} 07:12:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 07:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2)) 07:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 07:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 07:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5)) 07:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6)) 07:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7)) 07:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8)) 07:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 9)) 07:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 07:12:04 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 07:12:04 INFO - Cleaning up... 07:12:04 INFO - Return code: 0 07:12:04 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 07:12: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')]} 07:12:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:12:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12: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')]} 07:12:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:12:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12:04 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 0x7f8242e35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfaa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110b840>, '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 0x10786b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078b60>, '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': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', '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 07:12:04 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 07:12:04 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 07:12:04 INFO - Using env: {'DISPLAY': ':0', 07:12:04 INFO - 'HOME': '/home/cltbld', 07:12:04 INFO - 'LANG': 'en_US.UTF-8', 07:12:04 INFO - 'LANGUAGE': 'en_US:en', 07:12:04 INFO - 'LOGNAME': 'cltbld', 07:12:04 INFO - 'MAIL': '/var/mail/cltbld', 07:12:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:12:04 INFO - 'MOZ_NO_REMOTE': '1', 07:12:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:12:04 INFO - 'NO_EM_RESTART': '1', 07:12:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:12:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:12:04 INFO - 'PWD': '/builds/slave/test-pgo', 07:12:04 INFO - 'SHELL': '/bin/bash', 07:12:04 INFO - 'SHLVL': '1', 07:12:04 INFO - 'TERM': 'linux', 07:12:04 INFO - 'TMOUT': '86400', 07:12:04 INFO - 'USER': 'cltbld', 07:12:04 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', 07:12:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:12:04 INFO - '_': '/tools/buildbot/bin/python'} 07:12:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:12:05 INFO - Downloading/unpacking jsonschema 07:12: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 07:12: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 07:12: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 07:12: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 07:12: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 07:12: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 07:12:06 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:12:06 INFO - Downloading/unpacking functools32 (from jsonschema) 07:12:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:12:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:12:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:12:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:12:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:12:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:12:07 INFO - Downloading functools32-3.2.3-2.tar.gz 07:12:07 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 07:12:07 INFO - warning: no files found matching '*.txt' 07:12:07 INFO - no previously-included directories found matching 'build' 07:12:07 INFO - no previously-included directories found matching 'dist' 07:12:07 INFO - no previously-included directories found matching '.git*' 07:12:07 INFO - Installing collected packages: jsonschema, functools32 07:12:07 INFO - Running setup.py install for functools32 07:12:07 INFO - warning: no files found matching '*.txt' 07:12:07 INFO - no previously-included directories found matching 'build' 07:12:07 INFO - no previously-included directories found matching 'dist' 07:12:07 INFO - no previously-included directories found matching '.git*' 07:12:07 INFO - Successfully installed jsonschema functools32 07:12:07 INFO - Cleaning up... 07:12:07 INFO - Return code: 0 07:12:07 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 07:12: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')]} 07:12:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:12:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12: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')]} 07:12:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:12:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:12: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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f8242e35f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfaa8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107a630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110b840>, '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 0x10786b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078b60>, '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': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', '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 07:12: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', 'flake8'] in /builds/slave/test-pgo/build 07:12: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 flake8 07:12:07 INFO - Using env: {'DISPLAY': ':0', 07:12:07 INFO - 'HOME': '/home/cltbld', 07:12:07 INFO - 'LANG': 'en_US.UTF-8', 07:12:07 INFO - 'LANGUAGE': 'en_US:en', 07:12:07 INFO - 'LOGNAME': 'cltbld', 07:12:07 INFO - 'MAIL': '/var/mail/cltbld', 07:12:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:12:07 INFO - 'MOZ_NO_REMOTE': '1', 07:12:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:12:07 INFO - 'NO_EM_RESTART': '1', 07:12:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:12:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:12:07 INFO - 'PWD': '/builds/slave/test-pgo', 07:12:07 INFO - 'SHELL': '/bin/bash', 07:12:07 INFO - 'SHLVL': '1', 07:12:07 INFO - 'TERM': 'linux', 07:12:07 INFO - 'TMOUT': '86400', 07:12:07 INFO - 'USER': 'cltbld', 07:12:07 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', 07:12:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:12:07 INFO - '_': '/tools/buildbot/bin/python'} 07:12:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:12:07 INFO - Downloading/unpacking flake8 07:12:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:12:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:12:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:12:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 07:12:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 07:12:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 07:12:09 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 07:12:09 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 07:12: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 07:12: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 07:12: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 07:12: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 07:12: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 07:12: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 07:12:09 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 07:12:09 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 07:12: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 07:12: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 07:12: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 07:12: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 07:12: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 07:12: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 07:12:09 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 07:12: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 07:12: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 07:12: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 07:12: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 07:12: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 07:12: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 07:12:10 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 07:12:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:12:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:12:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:12:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:12:10 INFO - no previously-included directories found matching 'docs/_build' 07:12:10 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 07:12:10 INFO - Running setup.py install for pep8 07:12:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:12:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:12:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:12:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:12:10 INFO - no previously-included directories found matching 'docs/_build' 07:12:10 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 07:12:10 INFO - Successfully installed flake8 mccabe pyflakes pep8 07:12:10 INFO - Cleaning up... 07:12:10 INFO - Return code: 0 07:12:10 INFO - Running post-action listener: _resource_record_post_action 07:12:10 INFO - Running post-action listener: _start_resource_monitoring 07:12:10 INFO - Starting resource monitoring. 07:12:10 INFO - ##### 07:12:10 INFO - ##### Running install step. 07:12:10 INFO - ##### 07:12:10 INFO - Running pre-action listener: _resource_record_pre_action 07:12:10 INFO - Running main action method: install 07:12:10 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 07:12:10 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 07:12:10 INFO - Reading from file tmpfile_stdout 07:12:10 INFO - Detecting whether we're running mozinstall >=1.0... 07:12:10 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 07:12:10 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 07:12:10 INFO - Reading from file tmpfile_stdout 07:12:10 INFO - Output received: 07:12:10 INFO - Usage: mozinstall [options] installer 07:12:10 INFO - Options: 07:12:10 INFO - -h, --help show this help message and exit 07:12:10 INFO - -d DEST, --destination=DEST 07:12:10 INFO - Directory to install application into. [default: 07:12:10 INFO - "/builds/slave/test-pgo"] 07:12:10 INFO - --app=APP Application being installed. [default: firefox] 07:12:10 INFO - mkdir: /builds/slave/test-pgo/build/application 07:12:10 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'] 07:12:10 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 07:12:26 INFO - Reading from file tmpfile_stdout 07:12:26 INFO - Output received: 07:12:26 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 07:12:26 INFO - Running post-action listener: _resource_record_post_action 07:12:26 INFO - ##### 07:12:26 INFO - ##### Running run-tests step. 07:12:26 INFO - ##### 07:12:26 INFO - Running pre-action listener: _resource_record_pre_action 07:12:26 INFO - Running main action method: run_tests 07:12:26 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 07:12:26 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 07:12:26 INFO - Python 2.7.3 07:12:26 INFO - Return code: 0 07:12:26 INFO - grabbing minidump binary from tooltool 07:12:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:12:26 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x110b840>, '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 0x10786b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1078b60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 07:12:26 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 07:12:26 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 07:12:26 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:12:26 INFO - Return code: 0 07:12:26 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 07:12:26 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 07:12:26 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 07:12:26 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 07:12:26 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 07:12:26 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 07:12:26 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 07:12:27 INFO - Return code: 0 07:12:27 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/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-005', '--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 07:12:27 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/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-005 --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 07:12:27 INFO - Using env: {'DISPLAY': ':0', 07:12:27 INFO - 'HOME': '/home/cltbld', 07:12:27 INFO - 'LANG': 'en_US.UTF-8', 07:12:27 INFO - 'LANGUAGE': 'en_US:en', 07:12:27 INFO - 'LOGNAME': 'cltbld', 07:12:27 INFO - 'MAIL': '/var/mail/cltbld', 07:12:27 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 07:12:27 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 07:12:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:12:27 INFO - 'MOZ_NO_REMOTE': '1', 07:12:27 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 07:12:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:12:27 INFO - 'NO_EM_RESTART': '1', 07:12:27 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:12:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:12:27 INFO - 'PWD': '/builds/slave/test-pgo', 07:12:27 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 07:12:27 INFO - 'SHELL': '/bin/bash', 07:12:27 INFO - 'SHLVL': '1', 07:12:27 INFO - 'TERM': 'linux', 07:12:27 INFO - 'TMOUT': '86400', 07:12:27 INFO - 'USER': 'cltbld', 07:12:27 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569', 07:12:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:12:27 INFO - '_': '/tools/buildbot/bin/python'} 07:12:27 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/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-005', '--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 07:12:28 INFO - mozversion application_buildid: 20160201043002 07:12:28 INFO - mozversion application_changeset: 4d224eb479016d230706363d36c415c2f4960e75 07:12:28 INFO - mozversion application_display_name: Nightly 07:12:28 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:12:28 INFO - mozversion application_name: Firefox 07:12:28 INFO - mozversion application_remotingname: firefox 07:12:28 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 07:12:28 INFO - mozversion application_vendor: Mozilla 07:12:28 INFO - mozversion application_version: 47.0a1 07:12:28 INFO - mozversion platform_buildid: 20160201043002 07:12:28 INFO - mozversion platform_changeset: 4d224eb479016d230706363d36c415c2f4960e75 07:12:28 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 07:12:28 INFO - mozversion platform_version: 47.0a1 07:12:28 INFO - using testdate: 1454339548 07:12:28 INFO - actual date: 1454339548 07:12:28 INFO - starting webserver on 'localhost:60846' 07:12:28 INFO - SUITE-START | Running 2 tests 07:12:28 INFO - TEST-START | dromaeo_css 07:12:28 INFO - operating with platform_type : linux_ 07:12:28 INFO - Initialising browser for dromaeo_css test... 07:12:28 INFO - TEST-INFO | started process 4464 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpzYkPGf/profile http://localhost:60846/getInfo.html) 07:12:28 INFO - PROCESS | 4464 | JavaScript warning: resource://gre/modules/AddonManager.jsm, line 692: Proxy.create and Proxy.createFunction are deprecated, use new Proxy instead 07:12:31 INFO - PROCESS | 4464 | 07:12:31 INFO - PROCESS | 4464 | (process:4547): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:12:32 INFO - PROCESS | 4464 | __metrics Screen width/height:1600/1200 07:12:32 INFO - PROCESS | 4464 | colorDepth:24 07:12:32 INFO - PROCESS | 4464 | Browser inner width/height: 1024/697 07:12:32 INFO - PROCESS | 4464 | __metrics 07:12:32 INFO - PROCESS | 4464 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 07:12:33 INFO - TEST-INFO | 4464: exit 0 07:12:33 INFO - Browser initialized. 07:12:33 INFO - Running cycle 1/1 for dromaeo_css test... 07:12:33 INFO - TEST-INFO | started process 4596 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpzYkPGf/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:12:34 INFO - PROCESS | 4596 | 07:12:34 INFO - PROCESS | 4596 | (process:4652): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:12:45 INFO - PROCESS | 4596 | RSS: Main: 151629824 07:12:45 INFO - PROCESS | 4596 | 07:13:34 INFO - PROCESS | 4596 | 1454339614874 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] 07:15:44 INFO - PROCESS | 4596 | Cycle 1(1): loaded http://localhost:60846/tests/dromaeo/cssquery-dojo.html (next: http://localhost:60846/tests/dromaeo/cssquery-ext.html) 07:15:45 INFO - PROCESS | 4596 | RSS: Main: 160722944 07:15:45 INFO - PROCESS | 4596 | 07:18:47 INFO - PROCESS | 4596 | Cycle 1(1): loaded http://localhost:60846/tests/dromaeo/cssquery-ext.html (next: http://localhost:60846/tests/dromaeo/cssquery-jquery.html) 07:18:48 INFO - PROCESS | 4596 | RSS: Main: 156463104 07:18:48 INFO - PROCESS | 4596 | 07:21:49 INFO - PROCESS | 4596 | Cycle 1(1): loaded http://localhost:60846/tests/dromaeo/cssquery-jquery.html (next: http://localhost:60846/tests/dromaeo/cssquery-mootools.html) 07:21:50 INFO - PROCESS | 4596 | RSS: Main: 158257152 07:21:50 INFO - PROCESS | 4596 | 07:24:52 INFO - PROCESS | 4596 | Cycle 1(1): loaded http://localhost:60846/tests/dromaeo/cssquery-mootools.html (next: http://localhost:60846/tests/dromaeo/cssquery-prototype.html) 07:24:52 INFO - PROCESS | 4596 | RSS: Main: 155942912 07:24:52 INFO - PROCESS | 4596 | 07:27:55 INFO - PROCESS | 4596 | Cycle 1(1): loaded http://localhost:60846/tests/dromaeo/cssquery-prototype.html (next: http://localhost:60846/tests/dromaeo/cssquery-yui.html) 07:27:55 INFO - PROCESS | 4596 | RSS: Main: 155000832 07:27:55 INFO - PROCESS | 4596 | 07:30:58 INFO - PROCESS | 4596 | Cycle 1(1): loaded http://localhost:60846/tests/dromaeo/cssquery-yui.html (next: http://localhost:60846/tests/dromaeo/cssquery-dojo.html) 07:30:58 INFO - PROCESS | 4596 | RSS: Main: 158679040 07:30:58 INFO - PROCESS | 4596 | 07:30:58 INFO - PROCESS | 4596 | __start_tp_report 07:30:58 INFO - PROCESS | 4596 | _x_x_mozilla_page_load 07:30:58 INFO - PROCESS | 4596 | _x_x_mozilla_page_load_details 07:30:58 INFO - PROCESS | 4596 | |i|pagename|runs| 07:30:58 INFO - PROCESS | 4596 | |0;dojo.html;3177.2215807127254;3216.4210442120425;3251.073444068441;3253.9023829285125;3267.1505408593757;5135.3067335909645;5198.532132108109;5205.921911171331;5232.555232805206;5241.240020197074;5182.144946083901;5197.960407918413;5273.947260527393;5316.946830531693;5324.254604355384;4743.810247590092;4746.121967436018;4775.761211939406;4805.375301210837;4872.001239745861;4750.097481478525;4775.832845850396;4839.9516004840025;4881.389826271716;4953.752312384367;4651.441826980784;4713.95286047142;4720.57514823664;4785.042991401716;4793.065352256329;4750;4773.880652983668;4794.256890182028;4804.6876952997945;4820.421549414093;4729.834455794031;4753.664697575428;4767.570918617341;4770.356001939728;4772.164871147535;4946.752662366867;5044.873878153039;5079.466656001104;5103.1324674805;5139.460356662534;5659.688717120557;5669.461401166883;5677.886442271173;5687.40282270364;5692.48767610917;5669.603127781057;5675.886482270373;5696.344920334173;5706.001449746278;5725.370209276976;5163.1480805667015;5205.713685747244;5243.606729495303;5304.336957880265;5341.599380046473;5781.53747700183;5802.274715660543;5802.622829516068;5803.361630220672;5829.8251052468495;5526.917096243559;5541.141123125922;5574.609777315549;5607.383187849333;5609.971950140223;5509.063459211943;5543.889122217533;5653.943460565424;5674.205611214434;5719.914201286984;5553.694546799965;5609.102543593006;5610.943890561124;5622.128570071645;5658.321001479849;5568.972155139199;5597.160425936142;5605.635633683797;5607.495325420732;5624.21261023457;4247.150569886036;4301.526832048472;4347.174036932973;4405.3612226227015;4408.470983481939;3883.417487376916;3913;3919.8236079376497;3943.5662077171487;3957.426173204869;5355.839324820262;5372.462753724596;5376.569874410038;5377.78488860449;5378.1663842104535;5483.479069488392;5560.86097847549;5659.858503537444;5685.459881311269;5730.169125476866;5236.6857988520815;5282.102042652758;5299.099153143975;5300.337457817773;5300.443453437333;4740.715557066587;4852.17513022787;4855.44162421319;4855.684380515255;4894.192458244421;5662.065759149694;5822.621529600562;5853.0635098384055;5871.882562348815;5883.14694369314;5580.497755202051;5583.944160558342;5585.525230355465;5615.747291371817;5634.492895639248;5564.998300305821;5768.105943578752;5802.6808525531505;5824.9417505826095;5844.298684157929;5392.568594512351;5563.860903477445;5595.188697638738;5600.663960162403;5675.4040825714355;5529.944700552943;5632.802851900164;5639.295088113986;5649.802256920988;5652.886942261214;5340.279062326692;5431.755570999236;5542.473465020817;5545.556355491471;5568.6658800472105;5496.642718223463;5497.422770609029;5533.972330138324;5545.223668686468;5592.496675299242;5358.437364076872;5382.7308634567335;5429.809956651498;5430;5448.964696707613;5353.197020446964;5414.972925135349;5523;5562.666240025612;5573.804916827891;5426.213199086032;5449.073657478159;5456.918146227889;5469.343678758574;5474.507294343528 07:30:58 INFO - PROCESS | 4596 | |1;ext.html;543.8178210299546;562.9099344104943;568.6332315656399;572.5677113779096;586.0623003194888;35568.466473002896;36477.635223647754;36519.26961460769;36596.634033659655;36606.81696591517;38484.615153848456;39171;39281;39329.803350983275;39405.21189576207;8337.416380853343;8569.614367353484;8572.399932004762;8589.484630922134;8627.698030568932;8293.543855087968;8511.659533618647;8518.531480768555;8727.38908276421;8767.254783343424;8769.166929141722;8775.034746177915;8780.034196238408;8849.911500885006;8873.822523549557;8719.302455803552;8728.301735861147;8764.649414023432;8801.119888011212;8834.293256539526;8519.275861551776;8696;8722.825543489158;8726.781830454225;8735.912640873637;39212.411813822815;39556;39673.60326396728;39780.60219397798;39951.20097598061;3193.2495863472063;3237.6438591754886;3247.5615791868267;3442.5008373785913;3572.4462708280257;29365.11904642864;29559.556606650916;30001.549976750368;30224.24439389011;30807.537886931714;3649.087728067983;3688.686461650763;3753.080495278647;3807.428885667144;3953.604639536052;250834;252379.99999999817;254052;255959;256794;52279;52940.73529632327;57660.522250386144;57662;58042.4195758037;62237.68881155565;62660.686696567136;62748;62748.372516275165;62971.37028629747;15226.847731522543;15346.309416076303;15428.460003899809;15564.844351556567;15601.921990390203;11579;11636;11670.649880503599;11728.413579321;11837.526498940118;18633.440996770118;18858.52853678669;19030.33393831209;19473.123709433108;19636.607267854564;7909.406794490436;8147.266745992771;8210.466319689202;8309.626066826886;8351.791205219797;937.3625934364698;982.2829334585792;996.5615129343066;1069.2889228663007;1096.8848270931437;25536.872315638673;25761.871190643928;26294.6055809163;26905;26957.73042269552;1086.940218287986;1091.252492042953;1096.555894862582;1149.2127892393737;1167.9124065695107;14146.575602731935;14270.550187496223;14420.783688244685;14567.198804065878;14572.41710331596;348741;348779;351618;351906;353955;51260;52051.2192317108;52308;52390.738046309525;52455.73772131115;1295.844498660148;1338.7523308188017;1349.1567770143856;1352.499575157198;1363.6181869076675;25826.741732583185;26405.20784376395;26514;26667;26792.062277820183;38515.229695406495;39125.80437097796;39314.41028384634;39323.213535729694;39719;275794;276756;278594;278836;279154;31784;41381.58618413777;41686.58313416827;42241.15517689691;43154.352684710386;38174.236515270095;38506.80746596361;38548;39032.41451378175;39587.80206098951;33549.32901342008;33942.321153577286;33974.830125849214;34059.82970085134;40543.79728101341;36731;36924.630753692116;37322.253554929295;39047.21905561816;39874.80062599784;38327.23345533018;38553.614463855;38669.2266154681;38770.80614596909;39047.80476097715;38288.80855595704;38643.227135456575;39340.60659393484;39905;39964.80105596837;25752.61371079473;27022.594661079707;27166.592501112893;27180;27409 07:30:58 INFO - PROCESS | 4596 | |2;jquery.html;372.3372397133104;373.5107009817139;374.7021118211024;376.5349793005639;379.709522215505;15811.683766324666;16574.33702651894;16930.830691693078;17229.13854307286;17597.12014399281;10926.562937482511;10949.397783121925;11070.28043177193;11100.333979961208;11110.888891111086;4969.850904472872;5143.614228932826;5180.3265575475325;5206.21906713994;5393.352797664266;4805.807767689288;5149.0731668299695;5409.648372855751;5413.729313534327;5440.047991601474;5116.334876466054;5342.839714808562;5361.544268737162;5378.085725426687;5383.81156659517;5209.661372010845;5227.320448341729;5246.291750613656;5272.604554658416;5291.735413229323;5237.502437268454;5250.6324557281005;5281.234221037928;5287.735613219324;5299.099153143936;12440.626781196579;12515.624531263986;13110.410031548508;13136.737265254642;13168.53910113151;2120.130746393971;2140.678898165272;2167.7507086685077;2188.5732282204976;2189;9429.669961551313;9972.202223822149;10692.518836652369;11235.887641123647;11948.880511194864;1860.5069656540893;1895.6303520813447;1898.686716691758;1901.3820508334848;1938.3506525314037;57684;59039.704801476146;60630.696846515486;60961.78076438491;61629.38370616326;9757.414555126716;9933.304668673269;10095.343802652804;10145.391276523433;10222.897771022195;13392.598222053353;13466.192028478323;13477.258750768606;13508;13621.523246686318;7184.281571842878;7241.637918104074;7279.090113735783;7290.307420795016;7299.087614048244;6607.405333520006;6640.136782218281;6670.166229221348;6684.732610695518;6923.169219693669;3896.08442016126;4054.594540545922;4237.449131612871;4370.541093185233;4425.380446737395;1785.2680401035773;1815.972760408595;1859.5072305838964;1862.9534261643296;1872.5131465818986;821.8561751693429;916.812053529025;936.7517607833929;939.5599479016554;997.4563862694848;15992.680146397008;16190.919045404698;16288.592785180464;16664.50006499807;16880.071596062335;915.1306259053925;917.4357769971419;923.7459698582943;930.1721467893581;955.0926619711302;9228.907710922938;9447.858282125773;9714.3199976001;9726.17327527154;9841.124015138621;469326;480349;512349;521943;522737;68817;71960.2803971964;71977.6401117991;74149;74940.62529687426;1147.6901236666054;1182.6570294614467;1183.0476466444422;1185.4487663236464;1194.271494388405;14916.7762483565;15089.54731358061;15310.846891531388;15436;15527.22363881824;31929.521057183698;32265.838670806497;33198.170045748084;33317;34014.319713606084;41684.79157604193;43455.782721086194;46234.30648540207;46298.53701463077;47349;7224;7407.777766667009;7437.553746774995;7437.590932498764;7480.775576732707;11131.276467029616;11537.307761534335;11549.307041577196;11686.298822070703;11938.58214962472;9138.451692898447;9826.75433114178;9966.451845148586;10145.84781228297;10308.32995855267;9667.564959576695;10189.949050254998;10247.077763001365;10255.128314093387;10362;9890.85163722559;10223.7444063899;10363.578313012495;10511.842322365324;10712.785744284914;7128.6792094356915;7325.523840950321;7338.816529586803;7416.25837416254;7486.8876966844455;9275.582598782936;9648.517574121406;9951;9998.150157236716;10038.096571308617 07:30:58 INFO - PROCESS | 4596 | |3;mootools.html;1484.5101116631513;1518.7949626800382;1718.2353852535628;1807.3674214025084;1852.3887117251309;7479.214682458345;7504.324610785028;7677.3858091352695;7770.650320735566;7878.763637090882;7851.254130857574;7883.526988380701;7925.722599709012;7928.841423171533;7974.521528708282;2248.9437764055906;2291.667708182321;2296.2651951375565;2296.4603318220206;2299.37916762474;2306.285051633999;2327.77886100821;2370.111208296889;2373.6795532603137;2379.1791831817995;2241;2281.16737390852;2290.404494831339;2325.593021221288;2347.647852822073;2269.1944359752215;2296.081567373056;2301.355620426275;2319.35058183708;2322.059565875823;2329;2346.577616029114;2350.17743789674;2350.8824558771994;2355.328731311568;7700.152983171846;7744.7676569702435;7776.4167687423105;7792.532448053135;7820.335271501929;4655.348251244828;4788.592969597588;4790.826247569333;4808.783604737795;4842.346283251786;3055.8930437434583;3087.320789426323;3188.2826364068133;3190.3778763140963;3192.170035790711;948.4451595816456;956.3305686019744;1025.2515663565564;1028.5063169678597;1058.0583280880023;10889.455527223607;11000.119990400748;11040.447977601169;11088.611898583591;11132.053775429098;4324.524302326741;4422.358757980075;4430.911381772346;4462.48681401643;4478.977605111953;9501.192398646055;9530.142287194185;9549.61801527945;9567.61729530811;9615.759606009906;4809.687370320918;4851.56335929768;4871.902561948741;4873.244647079709;4880.170371036932;4395.1868904252815;4395.780210989437;4420.403245561808;4445.955540444619;4446.288593825037;3593.7781154407626;3710.2950439416422;3721.6464435878547;3725.9254814904093;3735.6637902588895;1127.5546159267208;1146.1117633833846;1146.9713257168637;1165.0970497864223;1168.2289688805347;1023.6621914768109;1080.5461706083463;1162.3723189477587;1245.1532957588927;1346.044308540947;6999.265077166926;7059.5058345915295;7104.325089116525;7175.17485489165;7231.421486281085;640.4588123036027;642.3351830855042;652.3378770547897;653.2911790707041;784.4548039112761;5442.074847275972;5446.1558458439;5557.805476808373;5584.944150558524;5608.46719561641;8983.55082245885;9326.300527460331;9385.67150149755;9444.480553569481;9497.667581634609;9471.289653276031;9482.288828337902;9572.760680982892;9581.377210481296;9643.566039528238;7367.963160184165;7372.96313518429;7446.32983031519;7504.549727016397;7534.35957943581;7002.579845209304;7085.751998680022;7150.249223831423;7154.534955227893;7164.89252661221;8367.246947774729;8612.138786121337;8662.566871656518;8730.56347182651;8821.382503224713;8323.750287491142;8423.199796019368;8486.490810551386;8523.659053637784;8770.342224333328;6835.487338449537;6939.271376505394;7007.089078419773;7011.684474198775;7016.438684905093;7217.097862767154;7253.3834624057545;7278;7290.854182916418;7295.635218239173;6171.84570385744;6802.659867006729;7092.468064895051;7123.679434425567;7136.4290856730295;6884.449244060363;6918.308169183041;6946.44428445713;7009.509334346547;7015.508914375945;6860.931390686229;6918.273581273894;6995;7003.859922801617;7027.648617568999;6361.395667411589;6432.485401167989;6438.356164383524;6457.6771161442675;6458.321876203119;6484.254310754323;6501.577397469149;6513.54405191632;6644.069830223676;6647.468202543688 07:30:58 INFO - PROCESS | 4596 | |4;prototype.html;349.5892326516343;351.6817280361273;355.80786375357303;361.257615599942;361.4523996145841;6171;6210.223722034746;6290.779822706206;6319.715612797424;6421.261554921191;5996.640201587897;6103.420175083371;6119.755209791603;6173.197484327043;6191.226096737908;4815.662903596758;4821.325014497973;4826.7586620669;4828.686135401188;4830.806767729304;4807.807687692505;4814.350062741538;4818.975905120487;4822.107910036637;4827.058723548909;4681.227597446417;4713.599344055742;4758.619310455173;4779.354787103731;4786.976065119669;4748.548887855683;4748.90502189956;4759.690620109682;4766.904661906777;4774.570288674036;4218.135282267128;4223.873283801491;4240.575942405735;4242.300020496615;4251.532331443539;5902.409759024106;5904.793332233394;5904.822855314347;5908.6454812710945;5939.227900372967;5418.783248670048;5559.499645031967;5593.720313984284;5595.552355811526;5603.439656034405;6526.902096468557;6563.638999855006;6575.572587781779;6604.834879128012;6620.569662971891;4711.693739906895;4712.410948631421;4713.575778179946;4718.268668356411;4729.574338309534;6759.32406759325;6910.827229319257;6947.40947019504;6952.826179345506;6952.860942781167;4805.255185446262;4832.395950506187;4832.9275060874115;4839.782209800567;4849.321095046696;4903.681260718042;4905.950940490549;4907.1167189905445;4909.337239472697;4912.459629440758;5582.162675598693;5584.46947539983;5585.441455854382;5589.077802162679;5611.3266408031295;6504.9674751625935;6687.966560167168;6689.297623749533;6693.966530167318;6697.229818570927;1619.7003554342484;1674.8325167483397;1683.4192203689709;1699.269314194908;1716.1419290354822;1119.2109562758235;1119.5186069989982;1133.0765426177638;1136.4772204785727;1139.2594813371375;6252.280987686383;6260.593061451083;6268.717907694165;6286.654234017173;6317.96841015792;6736.797896063126;6753.932460675331;6763.898541521881;6773.491988100912;6789.728410863609;6124.142620033199;6257.74969001244;6259.2488901332135;6261.592996455216;6265.624062556261;3662.377395842713;3674.338619048597;3676.283124790694;3703.055720791181;3704.7962362069807;6986.580805151707;7034.472414568825;7056.400205982446;7064.222935477093;7079.256678048834;6737.3599508046655;6905.482088843357;6911.550749201286;6912.239653638096;6938.167419909643;6999.720011199597;7009.369156776017;7057.294270572902;7057.470689698191;7061.646917654097;6644.966775166094;6714.899276510954;6720.563163394364;6736.326367363225;6754.392104710403;6570.474362050929;6684.933150668626;6733.293004234485;6735.865282694221;6764.3573860483175;7086.50394472382;7091.219965803861;7094.680739366638;7095.503314767917;7109.715611375694;4727.101850648366;4739.289106634033;4742.359781429463;4749.667523273476;4753.619710423089;6763.357481039294;6781.932180678327;6789.321067893171;6794.898076528955;6928.445724342141;6705.161854768154;6728.899066513908;6732.461403087839;6766.424853887278;6773.695183716646;6716.630585317855;6720.361565651256;6723.831904202239;6733.3939945405145;6741.59550426976;6471.708773105316;6593.901091483727;6605.438537724155;6633.535652504278;6640.501962352746;6666.933330666631;6721.428678562377;6753.797386078426;6760.290169532325;6779.89830152558;6540.542162048611;6544.869102618016;6593.109930159367;6595.868082638416;6606.042123892104 07:30:58 INFO - PROCESS | 4596 | |5;yui.html;734.4014628078113;745.9589722565257;760.4486747108347;793.0364607002494;827.5076329583898;12234.265944043353;12573.811392829115;12579.622611321663;12586.622401327975;12691.555795547147;12101.152919295653;12138.69653258669;12170.330631815246;12239.816402753966;12261.938690306535;791.2601717394241;794.6900708723603;806.0931452116369;814.6089876859111;818.664347617477;818.7093581778472;821.7534739578133;823.4853216739538;825.405707890318;826.7891687619649;848.8217474330398;851.29342645604;858.5063588436643;858.5707146426787;858.9957050214772;839.8320335932776;846.1496196322687;847.4279861093737;847.737201467547;848.7453763870814;622.6575383539035;623.4949690750507;626.3048016701458;632.2128949457908;632.8449529865167;12627.93686031573;12630.800073992956;12704.872951270461;12777.10560260782;12809.743805123939;12047.21693089955;12131.636050918487;12253.387330633434;12531.56139535121;12649.430775615027;10582.365058096539;10666.36001839892;10772.515236814363;10870.912908709066;10911.127109831194;3549;3570.535830342065;3640.1263696712863;3708.8887333380044;3728.067983004249;48399.758001210124;49531;50080.24879626808;50098;50124.24813627799;8914.73255802327;8933.316084347545;8995.190432861074;9026.684066057656;9124.908750912538;17693.292268309382;17758.822411775716;17795.46613601594;17947.910260448614;18011.819881801013;7314.597697126603;7413.221611730691;7425.8143546411775;7507;7517.060367454068;4302.7633480158265;4348.804303806336;4383.216672284924;4407.500099312763;4421.756803375845;3132.7493800495904;3187.075748033091;3198.1524895902603;3198.5202219667235;3221.25911040462;551.9613627046149;555.7054760976689;561.7444062951347;582.2169182449599;585.0755805826783;665.3280187011154;672.4889084295872;680.4381503638804;680.7753441364338;681.7852376501386;7552.616595578903;7694.499857509244;7722.227777222233;7827.882581761278;7970.920290797134;619.2689048482927;650.6486497291504;653.8823011857911;653.8921078022169;666.466826538767;3636.454531820248;3667.3215455140885;3772.358699021173;3785.242951409729;3795.994061573685;55776.72111639416;56593;56872.146917796264;57162;57166;50159.24761128586;51480;51803.74098129485;51855.222171667454;52323.47676523262;45565.544344556794;45666;46095;46265.843353917095;47200.76399618049;7424.637789209431;7596.544207347577;7629.504082234637;7629.6566654499575;7720.806979825325;33615.15962100967;34788.47817282692;34876.65123348835;34964.47553286754;35388.938331850084;40702;42974.785126074166;43442;44404.33393499165;44565.33152002658;9664.71005869825;9668.564914579001;9695.51522423862;10275.588976440858;10724.356538607708;11230.382328971986;11422.828657569977;11428.142889283503;11515.884841151816;11670.474828632561;9911.306208565331;10322.741931451774;10350.171986241234;10506.15950723925;10568.630097946534;10849.996016888494;11042.723931901766;11077.778444431227;11173.49719262619;11532.538698452303;10659.89340106589;11010.284331518425;11013;11052.392118433563;11411.828822567833;8637.69768058115;8646.56767161652;8709.695160669346;8848.46909185451;8955.283577313669;8626.5255410953;9072.818543629222;9379.437233765995;9423.670171543963;9424.219466485873 07:30:58 INFO - PROCESS | 4596 | __end_tp_report 07:30:58 INFO - PROCESS | 4596 | __start_cc_report 07:30:58 INFO - PROCESS | 4596 | _x_x_mozilla_cycle_collect,320 07:30:58 INFO - PROCESS | 4596 | __end_cc_report 07:30:58 INFO - PROCESS | 4596 | __startTimestamp1454340658404__endTimestamp 07:30:58 INFO - PROCESS | 4596 | 07:30:58 INFO - PROCESS | 4596 | ------- Summary: start ------- 07:30:58 INFO - PROCESS | 4596 | Number of tests: 6 07:30:58 INFO - PROCESS | 4596 | 07:30:58 INFO - PROCESS | 4596 | [#0] dojo.html Cycles:165 Average:5230.87 Median:5429.81 stddev:568.09 (10.5%) stddev-sans-first:546.51 07:30:58 INFO - PROCESS | 4596 | Values: 3177.2 3216.4 3251.1 3253.9 3267.2 5135.3 5198.5 5205.9 5232.6 5241.2 5182.1 5198.0 5273.9 5316.9 5324.3 4743.8 4746.1 4775.8 4805.4 4872.0 4750.1 4775.8 4840.0 4881.4 4953.8 4651.4 4714.0 4720.6 4785.0 4793.1 4750.0 4773.9 4794.3 4804.7 4820.4 4729.8 4753.7 4767.6 4770.4 4772.2 4946.8 5044.9 5079.5 5103.1 5139.5 5659.7 5669.5 5677.9 5687.4 5692.5 5669.6 5675.9 5696.3 5706.0 5725.4 5163.1 5205.7 5243.6 5304.3 5341.6 5781.5 5802.3 5802.6 5803.4 5829.8 5526.9 5541.1 5574.6 5607.4 5610.0 5509.1 5543.9 5653.9 5674.2 5719.9 5553.7 5609.1 5610.9 5622.1 5658.3 5569.0 5597.2 5605.6 5607.5 5624.2 4247.2 4301.5 4347.2 4405.4 4408.5 3883.4 3913.0 3919.8 3943.6 3957.4 5355.8 5372.5 5376.6 5377.8 5378.2 5483.5 5560.9 5659.9 5685.5 5730.2 5236.7 5282.1 5299.1 5300.3 5300.4 4740.7 4852.2 4855.4 4855.7 4894.2 5662.1 5822.6 5853.1 5871.9 5883.1 5580.5 5583.9 5585.5 5615.7 5634.5 5565.0 5768.1 5802.7 5824.9 5844.3 5392.6 5563.9 5595.2 5600.7 5675.4 5529.9 5632.8 5639.3 5649.8 5652.9 5340.3 5431.8 5542.5 5545.6 5568.7 5496.6 5497.4 5534.0 5545.2 5592.5 5358.4 5382.7 5429.8 5430.0 5449.0 5353.2 5415.0 5523.0 5562.7 5573.8 5426.2 5449.1 5456.9 5469.3 5474.5 07:30:58 INFO - PROCESS | 4596 | 07:30:58 INFO - PROCESS | 4596 | [#1] ext.html Cycles:180 Average:46403.51 Median:38308.02 stddev:77747.55 (203.0%) stddev-sans-first:77889.41 07:30:58 INFO - PROCESS | 4596 | Values: 543.8 562.9 568.6 572.6 586.1 35568.5 36477.6 36519.3 36596.6 36606.8 38484.6 39171.0 39281.0 39329.8 39405.2 8337.4 8569.6 8572.4 8589.5 8627.7 8293.5 8511.7 8518.5 8727.4 8767.3 8769.2 8775.0 8780.0 8849.9 8873.8 8719.3 8728.3 8764.6 8801.1 8834.3 8519.3 8696.0 8722.8 8726.8 8735.9 39212.4 39556.0 39673.6 39780.6 39951.2 3193.2 3237.6 3247.6 3442.5 3572.4 29365.1 29559.6 30001.5 30224.2 30807.5 3649.1 3688.7 3753.1 3807.4 3953.6 250834.0 252380.0 254052.0 255959.0 256794.0 52279.0 52940.7 57660.5 57662.0 58042.4 62237.7 62660.7 62748.0 62748.4 62971.4 15226.8 15346.3 15428.5 15564.8 15601.9 11579.0 11636.0 11670.6 11728.4 11837.5 18633.4 18858.5 19030.3 19473.1 19636.6 7909.4 8147.3 8210.5 8309.6 8351.8 937.4 982.3 996.6 1069.3 1096.9 25536.9 25761.9 26294.6 26905.0 26957.7 1086.9 1091.3 1096.6 1149.2 1167.9 14146.6 14270.6 14420.8 14567.2 14572.4 348741.0 348779.0 351618.0 351906.0 353955.0 51260.0 52051.2 52308.0 52390.7 52455.7 1295.8 1338.8 1349.2 1352.5 1363.6 25826.7 26405.2 26514.0 26667.0 26792.1 38515.2 39125.8 39314.4 39323.2 39719.0 275794.0 276756.0 278594.0 278836.0 279154.0 31784.0 41381.6 41686.6 42241.2 43154.4 38174.2 38506.8 38548.0 39032.4 39587.8 33549.3 33942.3 33974.8 34059.8 40543.8 36731.0 36924.6 37322.3 39047.2 39874.8 38327.2 38553.6 38669.2 38770.8 39047.8 38288.8 38643.2 39340.6 39905.0 39964.8 25752.6 27022.6 27166.6 27180.0 27409.0 07:30:58 INFO - PROCESS | 4596 | 07:30:58 INFO - PROCESS | 4596 | [#2] jquery.html Cycles:180 Average:26333.00 Median:257812.27 stddev:82100.19 (31.8%) stddev-sans-first:82307.36 07:30:58 INFO - PROCESS | 4596 | Values: 372.3 373.5 374.7 376.5 379.7 15811.7 16574.3 16930.8 17229.1 17597.1 10926.6 10949.4 11070.3 11100.3 11110.9 4969.9 5143.6 5180.3 5206.2 5393.4 4805.8 5149.1 5409.6 5413.7 5440.0 5116.3 5342.8 5361.5 5378.1 5383.8 5209.7 5227.3 5246.3 5272.6 5291.7 5237.5 5250.6 5281.2 5287.7 5299.1 12440.6 12515.6 13110.4 13136.7 13168.5 2120.1 2140.7 2167.8 2188.6 2189.0 9429.7 9972.2 10692.5 11235.9 11948.9 1860.5 1895.6 1898.7 1901.4 1938.4 57684.0 59039.7 60630.7 60961.8 61629.4 9757.4 9933.3 10095.3 10145.4 10222.9 13392.6 13466.2 13477.3 13508.0 13621.5 7184.3 7241.6 7279.1 7290.3 7299.1 6607.4 6640.1 6670.2 6684.7 6923.2 3896.1 4054.6 4237.4 4370.5 4425.4 1785.3 1816.0 1859.5 1863.0 1872.5 821.9 916.8 936.8 939.6 997.5 15992.7 16190.9 16288.6 16664.5 16880.1 915.1 917.4 923.7 930.2 955.1 9228.9 9447.9 9714.3 9726.2 9841.1 469326.0 480349.0 512349.0 521943.0 522737.0 68817.0 71960.3 71977.6 74149.0 74940.6 1147.7 1182.7 1183.0 1185.4 1194.3 14916.8 15089.5 15310.8 15436.0 15527.2 31929.5 32265.8 33198.2 33317.0 34014.3 41684.8 43455.8 46234.3 46298.5 47349.0 7224.0 7407.8 7437.6 7437.6 7480.8 11131.3 11537.3 11549.3 11686.3 11938.6 9138.5 9826.8 9966.5 10145.8 10308.3 9667.6 10189.9 10247.1 10255.1 10362.0 9890.9 10223.7 10363.6 10511.8 10712.8 7128.7 7325.5 7338.8 7416.3 7486.9 9275.6 9648.5 9951.0 9998.2 10038.1 07:30:58 INFO - PROCESS | 4596 | 07:30:58 INFO - PROCESS | 4596 | [#3] mootools.html Cycles:180 Average:5492.29 Median:6471.29 stddev:2864.69 (44.3%) stddev-sans-first:2856.88 07:30:58 INFO - PROCESS | 4596 | Values: 1484.5 1518.8 1718.2 1807.4 1852.4 7479.2 7504.3 7677.4 7770.7 7878.8 7851.3 7883.5 7925.7 7928.8 7974.5 2248.9 2291.7 2296.3 2296.5 2299.4 2306.3 2327.8 2370.1 2373.7 2379.2 2241.0 2281.2 2290.4 2325.6 2347.6 2269.2 2296.1 2301.4 2319.4 2322.1 2329.0 2346.6 2350.2 2350.9 2355.3 7700.2 7744.8 7776.4 7792.5 7820.3 4655.3 4788.6 4790.8 4808.8 4842.3 3055.9 3087.3 3188.3 3190.4 3192.2 948.4 956.3 1025.3 1028.5 1058.1 10889.5 11000.1 11040.4 11088.6 11132.1 4324.5 4422.4 4430.9 4462.5 4479.0 9501.2 9530.1 9549.6 9567.6 9615.8 4809.7 4851.6 4871.9 4873.2 4880.2 4395.2 4395.8 4420.4 4446.0 4446.3 3593.8 3710.3 3721.6 3725.9 3735.7 1127.6 1146.1 1147.0 1165.1 1168.2 1023.7 1080.5 1162.4 1245.2 1346.0 6999.3 7059.5 7104.3 7175.2 7231.4 640.5 642.3 652.3 653.3 784.5 5442.1 5446.2 5557.8 5584.9 5608.5 8983.6 9326.3 9385.7 9444.5 9497.7 9471.3 9482.3 9572.8 9581.4 9643.6 7368.0 7373.0 7446.3 7504.5 7534.4 7002.6 7085.8 7150.2 7154.5 7164.9 8367.2 8612.1 8662.6 8730.6 8821.4 8323.8 8423.2 8486.5 8523.7 8770.3 6835.5 6939.3 7007.1 7011.7 7016.4 7217.1 7253.4 7278.0 7290.9 7295.6 6171.8 6802.7 7092.5 7123.7 7136.4 6884.4 6918.3 6946.4 7009.5 7015.5 6860.9 6918.3 6995.0 7003.9 7027.6 6361.4 6432.5 6438.4 6457.7 6458.3 6484.3 6501.6 6513.5 6644.1 6647.5 07:30:58 INFO - PROCESS | 4596 | 07:30:58 INFO - PROCESS | 4596 | [#4] prototype.html Cycles:180 Average:5554.13 Median:6259.92 stddev:1655.97 (26.5%) stddev-sans-first:1613.89 07:30:58 INFO - PROCESS | 4596 | Values: 349.6 351.7 355.8 361.3 361.5 6171.0 6210.2 6290.8 6319.7 6421.3 5996.6 6103.4 6119.8 6173.2 6191.2 4815.7 4821.3 4826.8 4828.7 4830.8 4807.8 4814.4 4819.0 4822.1 4827.1 4681.2 4713.6 4758.6 4779.4 4787.0 4748.5 4748.9 4759.7 4766.9 4774.6 4218.1 4223.9 4240.6 4242.3 4251.5 5902.4 5904.8 5904.8 5908.6 5939.2 5418.8 5559.5 5593.7 5595.6 5603.4 6526.9 6563.6 6575.6 6604.8 6620.6 4711.7 4712.4 4713.6 4718.3 4729.6 6759.3 6910.8 6947.4 6952.8 6952.9 4805.3 4832.4 4832.9 4839.8 4849.3 4903.7 4906.0 4907.1 4909.3 4912.5 5582.2 5584.5 5585.4 5589.1 5611.3 6505.0 6688.0 6689.3 6694.0 6697.2 1619.7 1674.8 1683.4 1699.3 1716.1 1119.2 1119.5 1133.1 1136.5 1139.3 6252.3 6260.6 6268.7 6286.7 6318.0 6736.8 6753.9 6763.9 6773.5 6789.7 6124.1 6257.7 6259.2 6261.6 6265.6 3662.4 3674.3 3676.3 3703.1 3704.8 6986.6 7034.5 7056.4 7064.2 7079.3 6737.4 6905.5 6911.6 6912.2 6938.2 6999.7 7009.4 7057.3 7057.5 7061.6 6645.0 6714.9 6720.6 6736.3 6754.4 6570.5 6684.9 6733.3 6735.9 6764.4 7086.5 7091.2 7094.7 7095.5 7109.7 4727.1 4739.3 4742.4 4749.7 4753.6 6763.4 6781.9 6789.3 6794.9 6928.4 6705.2 6728.9 6732.5 6766.4 6773.7 6716.6 6720.4 6723.8 6733.4 6741.6 6471.7 6593.9 6605.4 6633.5 6640.5 6666.9 6721.4 6753.8 6760.3 6779.9 6540.5 6544.9 6593.1 6595.9 6606.0 07:30:58 INFO - PROCESS | 4596 | 07:30:58 INFO - PROCESS | 4596 | [#5] yui.html Cycles:180 Average:13488.34 Median:50141.75 stddev:15950.81 (31.8%) stddev-sans-first:15966.81 07:30:58 INFO - PROCESS | 4596 | Values: 734.4 746.0 760.4 793.0 827.5 12234.3 12573.8 12579.6 12586.6 12691.6 12101.2 12138.7 12170.3 12239.8 12261.9 791.3 794.7 806.1 814.6 818.7 818.7 821.8 823.5 825.4 826.8 848.8 851.3 858.5 858.6 859.0 839.8 846.1 847.4 847.7 848.7 622.7 623.5 626.3 632.2 632.8 12627.9 12630.8 12704.9 12777.1 12809.7 12047.2 12131.6 12253.4 12531.6 12649.4 10582.4 10666.4 10772.5 10870.9 10911.1 3549.0 3570.5 3640.1 3708.9 3728.1 48399.8 49531.0 50080.2 50098.0 50124.2 8914.7 8933.3 8995.2 9026.7 9124.9 17693.3 17758.8 17795.5 17947.9 18011.8 7314.6 7413.2 7425.8 7507.0 7517.1 4302.8 4348.8 4383.2 4407.5 4421.8 3132.7 3187.1 3198.2 3198.5 3221.3 552.0 555.7 561.7 582.2 585.1 665.3 672.5 680.4 680.8 681.8 7552.6 7694.5 7722.2 7827.9 7970.9 619.3 650.6 653.9 653.9 666.5 3636.5 3667.3 3772.4 3785.2 3796.0 55776.7 56593.0 56872.1 57162.0 57166.0 50159.2 51480.0 51803.7 51855.2 52323.5 45565.5 45666.0 46095.0 46265.8 47200.8 7424.6 7596.5 7629.5 7629.7 7720.8 33615.2 34788.5 34876.7 34964.5 35388.9 40702.0 42974.8 43442.0 44404.3 44565.3 9664.7 9668.6 9695.5 10275.6 10724.4 11230.4 11422.8 11428.1 11515.9 11670.5 9911.3 10322.7 10350.2 10506.2 10568.6 10850.0 11042.7 11077.8 11173.5 11532.5 10659.9 11010.3 11013.0 11052.4 11411.8 8637.7 8646.6 8709.7 8848.5 8955.3 8626.5 9072.8 9379.4 9423.7 9424.2 07:30:58 INFO - PROCESS | 4596 | -------- Summary: end -------- 07:30:58 INFO - PROCESS | 4596 | 07:30:59 INFO - TEST-INFO | 4596: exit 0 07:30:59 INFO - TEST-OK | dromaeo_css | took 1110935ms 07:30:59 INFO - TEST-START | kraken 07:30:59 INFO - operating with platform_type : linux_ 07:30:59 INFO - Initialising browser for kraken test... 07:30:59 INFO - TEST-INFO | started process 4840 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpJ3CzNu/profile http://localhost:60846/getInfo.html) 07:30:59 INFO - PROCESS | 4840 | JavaScript warning: resource://gre/modules/AddonManager.jsm, line 692: Proxy.create and Proxy.createFunction are deprecated, use new Proxy instead 07:31:02 INFO - PROCESS | 4840 | 07:31:02 INFO - PROCESS | 4840 | (process:4912): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:31:03 INFO - PROCESS | 4840 | __metrics Screen width/height:1600/1200 07:31:03 INFO - PROCESS | 4840 | colorDepth:24 07:31:03 INFO - PROCESS | 4840 | Browser inner width/height: 1024/697 07:31:03 INFO - PROCESS | 4840 | __metrics 07:31:03 INFO - PROCESS | 4840 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 07:31:04 INFO - TEST-INFO | 4840: exit 0 07:31:04 INFO - Browser initialized. 07:31:04 INFO - Running cycle 1/1 for kraken test... 07:31:04 INFO - TEST-INFO | started process 4961 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpJ3CzNu/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:31:05 INFO - PROCESS | 4961 | 07:31:05 INFO - PROCESS | 4961 | (process:5017): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:31:16 INFO - PROCESS | 4961 | RSS: Main: 151285760 07:31:16 INFO - PROCESS | 4961 | 07:31:18 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:60846/tests/kraken/driver.html?testName=audio-beat-detection) 07:31:19 INFO - PROCESS | 4961 | RSS: Main: 155832320 07:31:19 INFO - PROCESS | 4961 | 07:31:21 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:60846/tests/kraken/driver.html?testName=audio-dft) 07:31:22 INFO - PROCESS | 4961 | RSS: Main: 160563200 07:31:22 INFO - PROCESS | 4961 | 07:31:25 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:60846/tests/kraken/driver.html?testName=audio-fft) 07:31:25 INFO - PROCESS | 4961 | RSS: Main: 152129536 07:31:25 INFO - PROCESS | 4961 | 07:31:28 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:60846/tests/kraken/driver.html?testName=audio-oscillator) 07:31:28 INFO - PROCESS | 4961 | RSS: Main: 153747456 07:31:28 INFO - PROCESS | 4961 | 07:31:31 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:60846/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:31:31 INFO - PROCESS | 4961 | RSS: Main: 154148864 07:31:31 INFO - PROCESS | 4961 | 07:31:34 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:60846/tests/kraken/driver.html?testName=imaging-darkroom) 07:31:35 INFO - PROCESS | 4961 | RSS: Main: 153436160 07:31:35 INFO - PROCESS | 4961 | 07:31:38 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:60846/tests/kraken/driver.html?testName=imaging-desaturate) 07:31:39 INFO - PROCESS | 4961 | RSS: Main: 154152960 07:31:39 INFO - PROCESS | 4961 | 07:31:42 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:60846/tests/kraken/driver.html?testName=json-parse-financial) 07:31:42 INFO - PROCESS | 4961 | RSS: Main: 154431488 07:31:42 INFO - PROCESS | 4961 | 07:31:44 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:60846/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:31:44 INFO - PROCESS | 4961 | RSS: Main: 154591232 07:31:44 INFO - PROCESS | 4961 | 07:31:46 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:60846/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:31:47 INFO - PROCESS | 4961 | RSS: Main: 154804224 07:31:47 INFO - PROCESS | 4961 | 07:31:49 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:60846/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:31:49 INFO - PROCESS | 4961 | RSS: Main: 154882048 07:31:49 INFO - PROCESS | 4961 | 07:31:52 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:60846/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:31:53 INFO - PROCESS | 4961 | RSS: Main: 154755072 07:31:53 INFO - PROCESS | 4961 | 07:31:55 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:60846/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:31:56 INFO - PROCESS | 4961 | RSS: Main: 155246592 07:31:56 INFO - PROCESS | 4961 | 07:31:57 INFO - PROCESS | 4961 | Cycle 1(1): loaded http://localhost:60846/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:60846/tests/kraken/driver.html?testName=ai-astar) 07:31:58 INFO - PROCESS | 4961 | RSS: Main: 155648000 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | __start_tp_report 07:31:58 INFO - PROCESS | 4961 | _x_x_mozilla_page_load 07:31:58 INFO - PROCESS | 4961 | _x_x_mozilla_page_load_details 07:31:58 INFO - PROCESS | 4961 | |i|pagename|runs| 07:31:58 INFO - PROCESS | 4961 | |0;ai-astar;111;107;111;110;110;120;111;110;109;110 07:31:58 INFO - PROCESS | 4961 | |1;audio-beat-detection;154;125;153;158;127;154;156;132;165;129 07:31:58 INFO - PROCESS | 4961 | |2;audio-dft;166;166;165;165;164;166;163;170;173;162 07:31:58 INFO - PROCESS | 4961 | |3;audio-fft;76;74;74;76;76;75;77;130;75;74 07:31:58 INFO - PROCESS | 4961 | |4;audio-oscillator;96;96;137;97;97;96;147;95;96;146 07:31:58 INFO - PROCESS | 4961 | |5;imaging-gaussian-blur;120;116;115;115;116;115;115;115;115;115 07:31:58 INFO - PROCESS | 4961 | |6;imaging-darkroom;147;147;147;149;146;146;148;146;146;146 07:31:58 INFO - PROCESS | 4961 | |7;imaging-desaturate;97;97;96;98;96;97;97;96;97;97 07:31:58 INFO - PROCESS | 4961 | |8;json-parse-financial;59;58;58;59;58;58;60;58;58;56 07:31:58 INFO - PROCESS | 4961 | |9;json-stringify-tinderbox;68;67;68;68;69;68;67;69;68;69 07:31:58 INFO - PROCESS | 4961 | |10;stanford-crypto-aes;82;91;86;84;84;84;85;83;83;83 07:31:58 INFO - PROCESS | 4961 | |11;stanford-crypto-ccm;124;125;122;121;125;140;120;141;120;128 07:31:58 INFO - PROCESS | 4961 | |12;stanford-crypto-pbkdf2;146;161;151;155;150;149;151;149;140;136 07:31:58 INFO - PROCESS | 4961 | |13;stanford-crypto-sha256-iterative;69;71;68;78;70;68;68;67;67;72 07:31:58 INFO - PROCESS | 4961 | __end_tp_report 07:31:58 INFO - PROCESS | 4961 | __start_cc_report 07:31:58 INFO - PROCESS | 4961 | _x_x_mozilla_cycle_collect,711 07:31:58 INFO - PROCESS | 4961 | __end_cc_report 07:31:58 INFO - PROCESS | 4961 | __startTimestamp1454340718161__endTimestamp 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | ------- Summary: start ------- 07:31:58 INFO - PROCESS | 4961 | Number of tests: 14 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#0] ai-astar Cycles:10 Average:110.90 Median:110.50 stddev:3.41 (3.1%) stddev-sans-first:3.62 07:31:58 INFO - PROCESS | 4961 | Values: 111.0 107.0 111.0 110.0 110.0 120.0 111.0 110.0 109.0 110.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#1] audio-beat-detection Cycles:10 Average:145.30 Median:154.00 stddev:15.14 (9.8%) stddev-sans-first:15.73 07:31:58 INFO - PROCESS | 4961 | Values: 154.0 125.0 153.0 158.0 127.0 154.0 156.0 132.0 165.0 129.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#2] audio-dft Cycles:10 Average:166.00 Median:166.00 stddev:3.27 (2.0%) stddev-sans-first:3.46 07:31:58 INFO - PROCESS | 4961 | Values: 166.0 166.0 165.0 165.0 164.0 166.0 163.0 170.0 173.0 162.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#3] audio-fft Cycles:10 Average:80.70 Median:75.50 stddev:17.35 (23.0%) stddev-sans-first:18.32 07:31:58 INFO - PROCESS | 4961 | Values: 76.0 74.0 74.0 76.0 76.0 75.0 77.0 130.0 75.0 74.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#4] audio-oscillator Cycles:10 Average:110.30 Median:96.00 stddev:22.95 (23.9%) stddev-sans-first:23.75 07:31:58 INFO - PROCESS | 4961 | Values: 96.0 96.0 137.0 97.0 97.0 96.0 147.0 95.0 96.0 146.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#5] imaging-gaussian-blur Cycles:10 Average:115.70 Median:115.00 stddev:1.57 (1.4%) stddev-sans-first:0.44 07:31:58 INFO - PROCESS | 4961 | Values: 120.0 116.0 115.0 115.0 116.0 115.0 115.0 115.0 115.0 115.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#6] imaging-darkroom Cycles:10 Average:146.80 Median:147.00 stddev:1.03 (0.7%) stddev-sans-first:1.09 07:31:58 INFO - PROCESS | 4961 | Values: 147.0 147.0 147.0 149.0 146.0 146.0 148.0 146.0 146.0 146.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#7] imaging-desaturate Cycles:10 Average:96.80 Median:97.00 stddev:0.63 (0.7%) stddev-sans-first:0.67 07:31:58 INFO - PROCESS | 4961 | Values: 97.0 97.0 96.0 98.0 96.0 97.0 97.0 96.0 97.0 97.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#8] json-parse-financial Cycles:10 Average:58.20 Median:58.00 stddev:1.03 (1.8%) stddev-sans-first:1.05 07:31:58 INFO - PROCESS | 4961 | Values: 59.0 58.0 58.0 59.0 58.0 58.0 60.0 58.0 58.0 56.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#9] json-stringify-tinderbox Cycles:10 Average:68.10 Median:68.00 stddev:0.74 (1.1%) stddev-sans-first:0.78 07:31:58 INFO - PROCESS | 4961 | Values: 68.0 67.0 68.0 68.0 69.0 68.0 67.0 69.0 68.0 69.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#10] stanford-crypto-aes Cycles:10 Average:84.50 Median:84.00 stddev:2.55 (3.0%) stddev-sans-first:2.54 07:31:58 INFO - PROCESS | 4961 | Values: 82.0 91.0 86.0 84.0 84.0 84.0 85.0 83.0 83.0 83.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#11] stanford-crypto-ccm Cycles:10 Average:126.60 Median:125.00 stddev:7.75 (6.2%) stddev-sans-first:8.16 07:31:58 INFO - PROCESS | 4961 | Values: 124.0 125.0 122.0 121.0 125.0 140.0 120.0 141.0 120.0 128.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:148.80 Median:150.50 stddev:7.05 (4.7%) stddev-sans-first:7.41 07:31:58 INFO - PROCESS | 4961 | Values: 146.0 161.0 151.0 155.0 150.0 149.0 151.0 149.0 140.0 136.0 07:31:58 INFO - PROCESS | 4961 | 07:31:58 INFO - PROCESS | 4961 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.80 Median:69.50 stddev:3.33 (4.8%) stddev-sans-first:3.52 07:31:58 INFO - PROCESS | 4961 | Values: 69.0 71.0 68.0 78.0 70.0 68.0 68.0 67.0 67.0 72.0 07:31:58 INFO - PROCESS | 4961 | -------- Summary: end -------- 07:31:58 INFO - PROCESS | 4961 | 07:31:59 INFO - TEST-INFO | 4961: exit 0 07:31:59 INFO - TEST-OK | kraken | took 59992ms 07:31:59 INFO - SUITE-END | took 1170s 07:31:59 INFO - Completed test suite (00:19:31) 07:31:59 INFO - Working with test: dromaeo_css 07:31:59 INFO - Generating results file: dromaeo_css 07:31:59 INFO - Working with test: kraken 07:31:59 INFO - Generating results file: kraken 07:31:59 INFO - javascript benchmark 07:31:59 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:31:59 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,1,43]] 07:31:59 INFO - process_Request line: dromaeo_css 6881.83 graph.html#tests=[[72,1,43]] 07:31:59 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:31:59 INFO - process_Request line: kraken 1528.50 graph.html#tests=[[232,1,43]] 07:31:59 INFO - RETURN: dromaeo_css: 6881.83 07:31:59 INFO - RETURN: kraken: 1528.50 07:31:59 INFO - javascript benchmark 07:31:59 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3177.2215807127254, 3216.4210442120425, 3251.073444068441, 3253.9023829285125, 3267.1505408593757, 5135.3067335909645, 5198.532132108109, 5205.921911171331, 5232.555232805206, 5241.240020197074, 5182.144946083901, 5197.960407918413, 5273.947260527393, 5316.946830531693, 5324.254604355384, 4743.810247590092, 4746.121967436018, 4775.761211939406, 4805.375301210837, 4872.001239745861, 4750.097481478525, 4775.832845850396, 4839.9516004840025, 4881.389826271716, 4953.752312384367, 4651.441826980784, 4713.95286047142, 4720.57514823664, 4785.042991401716, 4793.065352256329, 4750.0, 4773.880652983668, 4794.256890182028, 4804.6876952997945, 4820.421549414093, 4729.834455794031, 4753.664697575428, 4767.570918617341, 4770.356001939728, 4772.164871147535, 4946.752662366867, 5044.873878153039, 5079.466656001104, 5103.1324674805, 5139.460356662534, 5659.688717120557, 5669.461401166883, 5677.886442271173, 5687.40282270364, 5692.48767610917, 5669.603127781057, 5675.886482270373, 5696.344920334173, 5706.001449746278, 5725.370209276976, 5163.1480805667015, 5205.713685747244, 5243.606729495303, 5304.336957880265, 5341.599380046473, 5781.53747700183, 5802.274715660543, 5802.622829516068, 5803.361630220672, 5829.8251052468495, 5526.917096243559, 5541.141123125922, 5574.609777315549, 5607.383187849333, 5609.971950140223, 5509.063459211943, 5543.889122217533, 5653.943460565424, 5674.205611214434, 5719.914201286984, 5553.694546799965, 5609.102543593006, 5610.943890561124, 5622.128570071645, 5658.321001479849, 5568.972155139199, 5597.160425936142, 5605.635633683797, 5607.495325420732, 5624.21261023457, 4247.150569886036, 4301.526832048472, 4347.174036932973, 4405.3612226227015, 4408.470983481939, 3883.417487376916, 3913.0, 3919.8236079376497, 3943.5662077171487, 3957.426173204869, 5355.839324820262, 5372.462753724596, 5376.569874410038, 5377.78488860449, 5378.1663842104535, 5483.479069488392, 5560.86097847549, 5659.858503537444, 5685.459881311269, 5730.169125476866, 5236.6857988520815, 5282.102042652758, 5299.099153143975, 5300.337457817773, 5300.443453437333, 4740.715557066587, 4852.17513022787, 4855.44162421319, 4855.684380515255, 4894.192458244421, 5662.065759149694, 5822.621529600562, 5853.0635098384055, 5871.882562348815, 5883.14694369314, 5580.497755202051, 5583.944160558342, 5585.525230355465, 5615.747291371817, 5634.492895639248, 5564.998300305821, 5768.105943578752, 5802.6808525531505, 5824.9417505826095, 5844.298684157929, 5392.568594512351, 5563.860903477445, 5595.188697638738, 5600.663960162403, 5675.4040825714355, 5529.944700552943, 5632.802851900164, 5639.295088113986, 5649.802256920988, 5652.886942261214, 5340.279062326692, 5431.755570999236, 5542.473465020817, 5545.556355491471, 5568.6658800472105, 5496.642718223463, 5497.422770609029, 5533.972330138324, 5545.223668686468, 5592.496675299242, 5358.437364076872, 5382.7308634567335, 5429.809956651498, 5430.0, 5448.964696707613, 5353.197020446964, 5414.972925135349, 5523.0, 5562.666240025612, 5573.804916827891, 5426.213199086032, 5449.073657478159, 5456.918146227889, 5469.343678758574, 5474.507294343528], "unit": "score", "name": "dojo.html", "value": 5195.349991405914}, {"lowerIsBetter": false, "replicates": [543.8178210299546, 562.9099344104943, 568.6332315656399, 572.5677113779096, 586.0623003194888, 35568.466473002896, 36477.635223647754, 36519.26961460769, 36596.634033659655, 36606.81696591517, 38484.615153848456, 39171.0, 39281.0, 39329.803350983275, 39405.21189576207, 8337.416380853343, 8569.614367353484, 8572.399932004762, 8589.484630922134, 8627.698030568932, 8293.543855087968, 8511.659533618647, 8518.531480768555, 8727.38908276421, 8767.254783343424, 8769.166929141722, 8775.034746177915, 8780.034196238408, 8849.911500885006, 8873.822523549557, 8719.302455803552, 8728.301735861147, 8764.649414023432, 8801.119888011212, 8834.293256539526, 8519.275861551776, 8696.0, 8722.825543489158, 8726.781830454225, 8735.912640873637, 39212.411813822815, 39556.0, 39673.60326396728, 39780.60219397798, 39951.20097598061, 3193.2495863472063, 3237.6438591754886, 3247.5615791868267, 3442.5008373785913, 3572.4462708280257, 29365.11904642864, 29559.556606650916, 30001.549976750368, 30224.24439389011, 30807.537886931714, 3649.087728067983, 3688.686461650763, 3753.080495278647, 3807.428885667144, 3953.604639536052, 250834.0, 252379.99999999817, 254052.0, 255959.0, 256794.0, 52279.0, 52940.73529632327, 57660.522250386144, 57662.0, 58042.4195758037, 62237.68881155565, 62660.686696567136, 62748.0, 62748.372516275165, 62971.37028629747, 15226.847731522543, 15346.309416076303, 15428.460003899809, 15564.844351556567, 15601.921990390203, 11579.0, 11636.0, 11670.649880503599, 11728.413579321, 11837.526498940118, 18633.440996770118, 18858.52853678669, 19030.33393831209, 19473.123709433108, 19636.607267854564, 7909.406794490436, 8147.266745992771, 8210.466319689202, 8309.626066826886, 8351.791205219797, 937.3625934364698, 982.2829334585792, 996.5615129343066, 1069.2889228663007, 1096.8848270931437, 25536.872315638673, 25761.871190643928, 26294.6055809163, 26905.0, 26957.73042269552, 1086.940218287986, 1091.252492042953, 1096.555894862582, 1149.2127892393737, 1167.9124065695107, 14146.575602731935, 14270.550187496223, 14420.783688244685, 14567.198804065878, 14572.41710331596, 348741.0, 348779.0, 351618.0, 351906.0, 353955.0, 51260.0, 52051.2192317108, 52308.0, 52390.738046309525, 52455.73772131115, 1295.844498660148, 1338.7523308188017, 1349.1567770143856, 1352.499575157198, 1363.6181869076675, 25826.741732583185, 26405.20784376395, 26514.0, 26667.0, 26792.062277820183, 38515.229695406495, 39125.80437097796, 39314.41028384634, 39323.213535729694, 39719.0, 275794.0, 276756.0, 278594.0, 278836.0, 279154.0, 31784.0, 41381.58618413777, 41686.58313416827, 42241.15517689691, 43154.352684710386, 38174.236515270095, 38506.80746596361, 38548.0, 39032.41451378175, 39587.80206098951, 33549.32901342008, 33942.321153577286, 33974.830125849214, 34059.82970085134, 40543.79728101341, 36731.0, 36924.630753692116, 37322.253554929295, 39047.21905561816, 39874.80062599784, 38327.23345533018, 38553.614463855, 38669.2266154681, 38770.80614596909, 39047.80476097715, 38288.80855595704, 38643.227135456575, 39340.60659393484, 39905.0, 39964.80105596837, 25752.61371079473, 27022.594661079707, 27166.592501112893, 27180.0, 27409.0], "unit": "score", "name": "ext.html", "value": 18458.89993258006}, {"lowerIsBetter": false, "replicates": [372.3372397133104, 373.5107009817139, 374.7021118211024, 376.5349793005639, 379.709522215505, 15811.683766324666, 16574.33702651894, 16930.830691693078, 17229.13854307286, 17597.12014399281, 10926.562937482511, 10949.397783121925, 11070.28043177193, 11100.333979961208, 11110.888891111086, 4969.850904472872, 5143.614228932826, 5180.3265575475325, 5206.21906713994, 5393.352797664266, 4805.807767689288, 5149.0731668299695, 5409.648372855751, 5413.729313534327, 5440.047991601474, 5116.334876466054, 5342.839714808562, 5361.544268737162, 5378.085725426687, 5383.81156659517, 5209.661372010845, 5227.320448341729, 5246.291750613656, 5272.604554658416, 5291.735413229323, 5237.502437268454, 5250.6324557281005, 5281.234221037928, 5287.735613219324, 5299.099153143936, 12440.626781196579, 12515.624531263986, 13110.410031548508, 13136.737265254642, 13168.53910113151, 2120.130746393971, 2140.678898165272, 2167.7507086685077, 2188.5732282204976, 2189.0, 9429.669961551313, 9972.202223822149, 10692.518836652369, 11235.887641123647, 11948.880511194864, 1860.5069656540893, 1895.6303520813447, 1898.686716691758, 1901.3820508334848, 1938.3506525314037, 57684.0, 59039.704801476146, 60630.696846515486, 60961.78076438491, 61629.38370616326, 9757.414555126716, 9933.304668673269, 10095.343802652804, 10145.391276523433, 10222.897771022195, 13392.598222053353, 13466.192028478323, 13477.258750768606, 13508.0, 13621.523246686318, 7184.281571842878, 7241.637918104074, 7279.090113735783, 7290.307420795016, 7299.087614048244, 6607.405333520006, 6640.136782218281, 6670.166229221348, 6684.732610695518, 6923.169219693669, 3896.08442016126, 4054.594540545922, 4237.449131612871, 4370.541093185233, 4425.380446737395, 1785.2680401035773, 1815.972760408595, 1859.5072305838964, 1862.9534261643296, 1872.5131465818986, 821.8561751693429, 916.812053529025, 936.7517607833929, 939.5599479016554, 997.4563862694848, 15992.680146397008, 16190.919045404698, 16288.592785180464, 16664.50006499807, 16880.071596062335, 915.1306259053925, 917.4357769971419, 923.7459698582943, 930.1721467893581, 955.0926619711302, 9228.907710922938, 9447.858282125773, 9714.3199976001, 9726.17327527154, 9841.124015138621, 469326.0, 480349.0, 512349.0, 521943.0, 522737.0, 68817.0, 71960.2803971964, 71977.6401117991, 74149.0, 74940.62529687426, 1147.6901236666054, 1182.6570294614467, 1183.0476466444422, 1185.4487663236464, 1194.271494388405, 14916.7762483565, 15089.54731358061, 15310.846891531388, 15436.0, 15527.22363881824, 31929.521057183698, 32265.838670806497, 33198.170045748084, 33317.0, 34014.319713606084, 41684.79157604193, 43455.782721086194, 46234.30648540207, 46298.53701463077, 47349.0, 7224.0, 7407.777766667009, 7437.553746774995, 7437.590932498764, 7480.775576732707, 11131.276467029616, 11537.307761534335, 11549.307041577196, 11686.298822070703, 11938.58214962472, 9138.451692898447, 9826.75433114178, 9966.451845148586, 10145.84781228297, 10308.32995855267, 9667.564959576695, 10189.949050254998, 10247.077763001365, 10255.128314093387, 10362.0, 9890.85163722559, 10223.7444063899, 10363.578313012495, 10511.842322365324, 10712.785744284914, 7128.6792094356915, 7325.523840950321, 7338.816529586803, 7416.25837416254, 7486.8876966844455, 9275.582598782936, 9648.517574121406, 9951.0, 9998.150157236716, 10038.096571308617], "unit": "score", "name": "jquery.html", "value": 8046.017474696567}, {"lowerIsBetter": false, "replicates": [1484.5101116631513, 1518.7949626800382, 1718.2353852535628, 1807.3674214025084, 1852.3887117251309, 7479.214682458345, 7504.324610785028, 7677.3858091352695, 7770.650320735566, 7878.763637090882, 7851.254130857574, 7883.526988380701, 7925.722599709012, 7928.841423171533, 7974.521528708282, 2248.9437764055906, 2291.667708182321, 2296.2651951375565, 2296.4603318220206, 2299.37916762474, 2306.285051633999, 2327.77886100821, 2370.111208296889, 2373.6795532603137, 2379.1791831817995, 2241.0, 2281.16737390852, 2290.404494831339, 2325.593021221288, 2347.647852822073, 2269.1944359752215, 2296.081567373056, 2301.355620426275, 2319.35058183708, 2322.059565875823, 2329.0, 2346.577616029114, 2350.17743789674, 2350.8824558771994, 2355.328731311568, 7700.152983171846, 7744.7676569702435, 7776.4167687423105, 7792.532448053135, 7820.335271501929, 4655.348251244828, 4788.592969597588, 4790.826247569333, 4808.783604737795, 4842.346283251786, 3055.8930437434583, 3087.320789426323, 3188.2826364068133, 3190.3778763140963, 3192.170035790711, 948.4451595816456, 956.3305686019744, 1025.2515663565564, 1028.5063169678597, 1058.0583280880023, 10889.455527223607, 11000.119990400748, 11040.447977601169, 11088.611898583591, 11132.053775429098, 4324.524302326741, 4422.358757980075, 4430.911381772346, 4462.48681401643, 4478.977605111953, 9501.192398646055, 9530.142287194185, 9549.61801527945, 9567.61729530811, 9615.759606009906, 4809.687370320918, 4851.56335929768, 4871.902561948741, 4873.244647079709, 4880.170371036932, 4395.1868904252815, 4395.780210989437, 4420.403245561808, 4445.955540444619, 4446.288593825037, 3593.7781154407626, 3710.2950439416422, 3721.6464435878547, 3725.9254814904093, 3735.6637902588895, 1127.5546159267208, 1146.1117633833846, 1146.9713257168637, 1165.0970497864223, 1168.2289688805347, 1023.6621914768109, 1080.5461706083463, 1162.3723189477587, 1245.1532957588927, 1346.044308540947, 6999.265077166926, 7059.5058345915295, 7104.325089116525, 7175.17485489165, 7231.421486281085, 640.4588123036027, 642.3351830855042, 652.3378770547897, 653.2911790707041, 784.4548039112761, 5442.074847275972, 5446.1558458439, 5557.805476808373, 5584.944150558524, 5608.46719561641, 8983.55082245885, 9326.300527460331, 9385.67150149755, 9444.480553569481, 9497.667581634609, 9471.289653276031, 9482.288828337902, 9572.760680982892, 9581.377210481296, 9643.566039528238, 7367.963160184165, 7372.96313518429, 7446.32983031519, 7504.549727016397, 7534.35957943581, 7002.579845209304, 7085.751998680022, 7150.249223831423, 7154.534955227893, 7164.89252661221, 8367.246947774729, 8612.138786121337, 8662.566871656518, 8730.56347182651, 8821.382503224713, 8323.750287491142, 8423.199796019368, 8486.490810551386, 8523.659053637784, 8770.342224333328, 6835.487338449537, 6939.271376505394, 7007.089078419773, 7011.684474198775, 7016.438684905093, 7217.097862767154, 7253.3834624057545, 7278.0, 7290.854182916418, 7295.635218239173, 6171.84570385744, 6802.659867006729, 7092.468064895051, 7123.679434425567, 7136.4290856730295, 6884.449244060363, 6918.308169183041, 6946.44428445713, 7009.509334346547, 7015.508914375945, 6860.931390686229, 6918.273581273894, 6995.0, 7003.859922801617, 7027.648617568999, 6361.395667411589, 6432.485401167989, 6438.356164383524, 6457.6771161442675, 6458.321876203119, 6484.254310754323, 6501.577397469149, 6513.54405191632, 6644.069830223676, 6647.468202543688], "unit": "score", "name": "mootools.html", "value": 4470.513122658692}, {"lowerIsBetter": false, "replicates": [349.5892326516343, 351.6817280361273, 355.80786375357303, 361.257615599942, 361.4523996145841, 6171.0, 6210.223722034746, 6290.779822706206, 6319.715612797424, 6421.261554921191, 5996.640201587897, 6103.420175083371, 6119.755209791603, 6173.197484327043, 6191.226096737908, 4815.662903596758, 4821.325014497973, 4826.7586620669, 4828.686135401188, 4830.806767729304, 4807.807687692505, 4814.350062741538, 4818.975905120487, 4822.107910036637, 4827.058723548909, 4681.227597446417, 4713.599344055742, 4758.619310455173, 4779.354787103731, 4786.976065119669, 4748.548887855683, 4748.90502189956, 4759.690620109682, 4766.904661906777, 4774.570288674036, 4218.135282267128, 4223.873283801491, 4240.575942405735, 4242.300020496615, 4251.532331443539, 5902.409759024106, 5904.793332233394, 5904.822855314347, 5908.6454812710945, 5939.227900372967, 5418.783248670048, 5559.499645031967, 5593.720313984284, 5595.552355811526, 5603.439656034405, 6526.902096468557, 6563.638999855006, 6575.572587781779, 6604.834879128012, 6620.569662971891, 4711.693739906895, 4712.410948631421, 4713.575778179946, 4718.268668356411, 4729.574338309534, 6759.32406759325, 6910.827229319257, 6947.40947019504, 6952.826179345506, 6952.860942781167, 4805.255185446262, 4832.395950506187, 4832.9275060874115, 4839.782209800567, 4849.321095046696, 4903.681260718042, 4905.950940490549, 4907.1167189905445, 4909.337239472697, 4912.459629440758, 5582.162675598693, 5584.46947539983, 5585.441455854382, 5589.077802162679, 5611.3266408031295, 6504.9674751625935, 6687.966560167168, 6689.297623749533, 6693.966530167318, 6697.229818570927, 1619.7003554342484, 1674.8325167483397, 1683.4192203689709, 1699.269314194908, 1716.1419290354822, 1119.2109562758235, 1119.5186069989982, 1133.0765426177638, 1136.4772204785727, 1139.2594813371375, 6252.280987686383, 6260.593061451083, 6268.717907694165, 6286.654234017173, 6317.96841015792, 6736.797896063126, 6753.932460675331, 6763.898541521881, 6773.491988100912, 6789.728410863609, 6124.142620033199, 6257.74969001244, 6259.2488901332135, 6261.592996455216, 6265.624062556261, 3662.377395842713, 3674.338619048597, 3676.283124790694, 3703.055720791181, 3704.7962362069807, 6986.580805151707, 7034.472414568825, 7056.400205982446, 7064.222935477093, 7079.256678048834, 6737.3599508046655, 6905.482088843357, 6911.550749201286, 6912.239653638096, 6938.167419909643, 6999.720011199597, 7009.369156776017, 7057.294270572902, 7057.470689698191, 7061.646917654097, 6644.966775166094, 6714.899276510954, 6720.563163394364, 6736.326367363225, 6754.392104710403, 6570.474362050929, 6684.933150668626, 6733.293004234485, 6735.865282694221, 6764.3573860483175, 7086.50394472382, 7091.219965803861, 7094.680739366638, 7095.503314767917, 7109.715611375694, 4727.101850648366, 4739.289106634033, 4742.359781429463, 4749.667523273476, 4753.619710423089, 6763.357481039294, 6781.932180678327, 6789.321067893171, 6794.898076528955, 6928.445724342141, 6705.161854768154, 6728.899066513908, 6732.461403087839, 6766.424853887278, 6773.695183716646, 6716.630585317855, 6720.361565651256, 6723.831904202239, 6733.3939945405145, 6741.59550426976, 6471.708773105316, 6593.901091483727, 6605.438537724155, 6633.535652504278, 6640.501962352746, 6666.933330666631, 6721.428678562377, 6753.797386078426, 6760.290169532325, 6779.89830152558, 6540.542162048611, 6544.869102618016, 6593.109930159367, 6595.868082638416, 6606.042123892104], "unit": "score", "name": "prototype.html", "value": 5015.659277276452}, {"lowerIsBetter": false, "replicates": [734.4014628078113, 745.9589722565257, 760.4486747108347, 793.0364607002494, 827.5076329583898, 12234.265944043353, 12573.811392829115, 12579.622611321663, 12586.622401327975, 12691.555795547147, 12101.152919295653, 12138.69653258669, 12170.330631815246, 12239.816402753966, 12261.938690306535, 791.2601717394241, 794.6900708723603, 806.0931452116369, 814.6089876859111, 818.664347617477, 818.7093581778472, 821.7534739578133, 823.4853216739538, 825.405707890318, 826.7891687619649, 848.8217474330398, 851.29342645604, 858.5063588436643, 858.5707146426787, 858.9957050214772, 839.8320335932776, 846.1496196322687, 847.4279861093737, 847.737201467547, 848.7453763870814, 622.6575383539035, 623.4949690750507, 626.3048016701458, 632.2128949457908, 632.8449529865167, 12627.93686031573, 12630.800073992956, 12704.872951270461, 12777.10560260782, 12809.743805123939, 12047.21693089955, 12131.636050918487, 12253.387330633434, 12531.56139535121, 12649.430775615027, 10582.365058096539, 10666.36001839892, 10772.515236814363, 10870.912908709066, 10911.127109831194, 3549.0, 3570.535830342065, 3640.1263696712863, 3708.8887333380044, 3728.067983004249, 48399.758001210124, 49531.0, 50080.24879626808, 50098.0, 50124.24813627799, 8914.73255802327, 8933.316084347545, 8995.190432861074, 9026.684066057656, 9124.908750912538, 17693.292268309382, 17758.822411775716, 17795.46613601594, 17947.910260448614, 18011.819881801013, 7314.597697126603, 7413.221611730691, 7425.8143546411775, 7507.0, 7517.060367454068, 4302.7633480158265, 4348.804303806336, 4383.216672284924, 4407.500099312763, 4421.756803375845, 3132.7493800495904, 3187.075748033091, 3198.1524895902603, 3198.5202219667235, 3221.25911040462, 551.9613627046149, 555.7054760976689, 561.7444062951347, 582.2169182449599, 585.0755805826783, 665.3280187011154, 672.4889084295872, 680.4381503638804, 680.7753441364338, 681.7852376501386, 7552.616595578903, 7694.499857509244, 7722.227777222233, 7827.882581761278, 7970.920290797134, 619.2689048482927, 650.6486497291504, 653.8823011857911, 653.8921078022169, 666.466826538767, 3636.454531820248, 3667.3215455140885, 3772.358699021173, 3785.242951409729, 3795.994061573685, 55776.72111639416, 56593.0, 56872.146917796264, 57162.0, 57166.0, 50159.24761128586, 51480.0, 51803.74098129485, 51855.222171667454, 52323.47676523262, 45565.544344556794, 45666.0, 46095.0, 46265.843353917095, 47200.76399618049, 7424.637789209431, 7596.544207347577, 7629.504082234637, 7629.6566654499575, 7720.806979825325, 33615.15962100967, 34788.47817282692, 34876.65123348835, 34964.47553286754, 35388.938331850084, 40702.0, 42974.785126074166, 43442.0, 44404.33393499165, 44565.33152002658, 9664.71005869825, 9668.564914579001, 9695.51522423862, 10275.588976440858, 10724.356538607708, 11230.382328971986, 11422.828657569977, 11428.142889283503, 11515.884841151816, 11670.474828632561, 9911.306208565331, 10322.741931451774, 10350.171986241234, 10506.15950723925, 10568.630097946534, 10849.996016888494, 11042.723931901766, 11077.778444431227, 11173.49719262619, 11532.538698452303, 10659.89340106589, 11010.284331518425, 11013.0, 11052.392118433563, 11411.828822567833, 8637.69768058115, 8646.56767161652, 8709.695160669346, 8848.46909185451, 8955.283577313669, 8626.5255410953, 9072.818543629222, 9379.437233765995, 9423.670171543963, 9424.219466485873], "unit": "score", "name": "yui.html", "value": 6139.021950201015}], "name": "dromaeo_css", "value": 6881.828580010785}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 107.0, 111.0, 110.0, 110.0, 120.0, 111.0, 110.0, 109.0, 110.0], "unit": "score", "name": "ai-astar", "value": 110.9}, {"lowerIsBetter": true, "replicates": [154.0, 125.0, 153.0, 158.0, 127.0, 154.0, 156.0, 132.0, 165.0, 129.0], "unit": "score", "name": "audio-beat-detection", "value": 145.3}, {"lowerIsBetter": true, "replicates": [166.0, 166.0, 165.0, 165.0, 164.0, 166.0, 163.0, 170.0, 173.0, 162.0], "unit": "score", "name": "audio-dft", "value": 166.0}, {"lowerIsBetter": true, "replicates": [76.0, 74.0, 74.0, 76.0, 76.0, 75.0, 77.0, 130.0, 75.0, 74.0], "unit": "score", "name": "audio-fft", "value": 80.7}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 137.0, 97.0, 97.0, 96.0, 147.0, 95.0, 96.0, 146.0], "unit": "score", "name": "audio-oscillator", "value": 110.3}, {"lowerIsBetter": true, "replicates": [120.0, 116.0, 115.0, 115.0, 116.0, 115.0, 115.0, 115.0, 115.0, 115.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.7}, {"lowerIsBetter": true, "replicates": [147.0, 147.0, 147.0, 149.0, 146.0, 146.0, 148.0, 146.0, 146.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 146.8}, {"lowerIsBetter": true, "replicates": [97.0, 97.0, 96.0, 98.0, 96.0, 97.0, 97.0, 96.0, 97.0, 97.0], "unit": "score", "name": "imaging-desaturate", "value": 96.8}, {"lowerIsBetter": true, "replicates": [59.0, 58.0, 58.0, 59.0, 58.0, 58.0, 60.0, 58.0, 58.0, 56.0], "unit": "score", "name": "json-parse-financial", "value": 58.2}, {"lowerIsBetter": true, "replicates": [68.0, 67.0, 68.0, 68.0, 69.0, 68.0, 67.0, 69.0, 68.0, 69.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.1}, {"lowerIsBetter": true, "replicates": [82.0, 91.0, 86.0, 84.0, 84.0, 84.0, 85.0, 83.0, 83.0, 83.0], "unit": "score", "name": "stanford-crypto-aes", "value": 84.5}, {"lowerIsBetter": true, "replicates": [124.0, 125.0, 122.0, 121.0, 125.0, 140.0, 120.0, 141.0, 120.0, 128.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 126.6}, {"lowerIsBetter": true, "replicates": [146.0, 161.0, 151.0, 155.0, 150.0, 149.0, 151.0, 149.0, 140.0, 136.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 148.8}, {"lowerIsBetter": true, "replicates": [69.0, 71.0, 68.0, 78.0, 70.0, 68.0, 68.0, 67.0, 67.0, 72.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 69.8}], "name": "kraken", "value": 1528.4999999999998}]} 07:31:59 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,1,43]]", "result": "1528.50"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,1,43]]", "result": "6881.83"}}} 07:31:59 INFO - Return code: 0 07:31:59 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 07:31:59 INFO - # TBPL SUCCESS # 07:31:59 INFO - Running post-action listener: _resource_record_post_action 07:31:59 INFO - Running post-run listener: _resource_record_post_run 07:32:00 INFO - Total resource usage - Wall time: 1189s; CPU: 13.0%; Read bytes: 4096; Write bytes: 536510464; Read time: 164; Write time: 382944 07:32:00 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 4096; Write bytes: 238460928; Read time: 164; Write time: 176904 07:32:00 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 0; Write bytes: 297762816; Read time: 0; Write time: 206016 07:32:00 INFO - Running post-run listener: _upload_blobber_files 07:32:00 INFO - Blob upload gear active. 07:32:00 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 07:32:00 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 07:32:00 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'] 07:32:00 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 07:32:01 INFO - (blobuploader) - INFO - Open directory for files ... 07:32:01 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 07:32:01 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:32:01 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:32:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 07:32:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:32:01 INFO - (blobuploader) - INFO - Done attempting. 07:32:01 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 07:32:01 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:32:01 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:32:02 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 07:32:02 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:32:02 INFO - (blobuploader) - INFO - Done attempting. 07:32:02 INFO - (blobuploader) - INFO - Iteration through files over. 07:32:02 INFO - Return code: 0 07:32:02 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 07:32:02 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 07:32:02 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/243ff7d515825528273efeeaba8ef66b37ddfdb54c94da14cf4dc33082e21f9a1f641ed069dcdf380b7ae9a8d373e1a2d26a251030d78b6c006ce7db3b9ffcb6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/5650b539cbcae0f54bf8d3568bc9550207ec9b2722bcedd1821a1a564521a467f42c98e9e6c304794fcd1c36e1e30c9a38a128ef8f9edfd284395abe5ca0a9a2"} 07:32:02 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 07:32:02 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 07:32:02 INFO - Contents: 07:32:02 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/243ff7d515825528273efeeaba8ef66b37ddfdb54c94da14cf4dc33082e21f9a1f641ed069dcdf380b7ae9a8d373e1a2d26a251030d78b6c006ce7db3b9ffcb6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/5650b539cbcae0f54bf8d3568bc9550207ec9b2722bcedd1821a1a564521a467f42c98e9e6c304794fcd1c36e1e30c9a38a128ef8f9edfd284395abe5ca0a9a2"} 07:32:02 INFO - Running post-run listener: copy_logs_to_upload_dir 07:32:02 INFO - Copying logs to upload dir... 07:32:02 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 07:32:02 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1240.460632 ========= master_lag: 50.33 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 30 secs) (at 2016-02-01 07:32:52.302882) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-01 07:32:52.306702) ========= 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=7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569 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/243ff7d515825528273efeeaba8ef66b37ddfdb54c94da14cf4dc33082e21f9a1f641ed069dcdf380b7ae9a8d373e1a2d26a251030d78b6c006ce7db3b9ffcb6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/5650b539cbcae0f54bf8d3568bc9550207ec9b2722bcedd1821a1a564521a467f42c98e9e6c304794fcd1c36e1e30c9a38a128ef8f9edfd284395abe5ca0a9a2"} build_url:https://queue.taskcluster.net/v1/task/ZkTKYEihQ6eEP4InrhRwKg/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011410 build_url: 'https://queue.taskcluster.net/v1/task/ZkTKYEihQ6eEP4InrhRwKg/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/243ff7d515825528273efeeaba8ef66b37ddfdb54c94da14cf4dc33082e21f9a1f641ed069dcdf380b7ae9a8d373e1a2d26a251030d78b6c006ce7db3b9ffcb6", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/5650b539cbcae0f54bf8d3568bc9550207ec9b2722bcedd1821a1a564521a467f42c98e9e6c304794fcd1c36e1e30c9a38a128ef8f9edfd284395abe5ca0a9a2"}' ========= master_lag: 0.20 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-01 07:32:52.517804) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 07:32:52.518186) ========= 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=7fc86f70bae03e018da0b1d8000001c4-1454337333.745766-2107959569 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004546 ========= master_lag: 0.18 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-01 07:32:52.704033) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-01 07:32:52.704485) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-01 07:32:52.709010) ========= ========= Total master_lag: 50.89 =========