builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-058 starttime: 1462534470.11 results: success (0) buildid: 20160506013623 builduid: 3e330e94e72a44aabac68afc380e9ed1 revision: b61ad3a6049cbcfe4945897e94b8d7ce5beb5c5f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:30.112023) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:30.112583) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:30.112902) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:30.127196) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:30.127594) ========= 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/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-05-06 04:34:30-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 227M=0s 2016-05-06 04:34:30 (227 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.070687 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:30.210916) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:30.211390) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', '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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019870 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:30.262060) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:30.262420) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev b61ad3a6049cbcfe4945897e94b8d7ce5beb5c5f --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev b61ad3a6049cbcfe4945897e94b8d7ce5beb5c5f --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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-05-06 04:34:30,977 truncating revision to first 12 chars 2016-05-06 04:34:30,977 Setting DEBUG logging. 2016-05-06 04:34:30,977 attempt 1/10 2016-05-06 04:34:30,977 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/b61ad3a6049c?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-05-06 04:34:31,555 unpacking tar archive at: mozilla-aurora-b61ad3a6049c/testing/mozharness/ program finished with exit code 0 elapsedTime=0.872501 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:31.149874) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:31.150287) ========= script_repo_revision: b61ad3a6049cbcfe4945897e94b8d7ce5beb5c5f ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:31.150917) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:31.151228) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-06 04:34:31.160560) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 29 secs) (at 2016-05-06 04:34:31.160876) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (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', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:34:31 INFO - MultiFileLogger online at 20160506 04:34:31 in /builds/slave/test 04:34:31 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 04:34:31 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:34:31 INFO - {'append_to_log': False, 04:34:31 INFO - 'base_work_dir': '/builds/slave/test', 04:34:31 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 04:34:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:34:31 INFO - 'branch': 'Mozilla-Aurora', 04:34:31 INFO - 'buildbot_json_path': 'buildprops.json', 04:34:31 INFO - 'config_files': ('talos/linux_config.py',), 04:34:31 INFO - 'default_actions': ('clobber', 04:34:31 INFO - 'read-buildbot-config', 04:34:31 INFO - 'download-and-extract', 04:34:31 INFO - 'populate-webroot', 04:34:31 INFO - 'create-virtualenv', 04:34:31 INFO - 'install', 04:34:31 INFO - 'run-tests'), 04:34:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:34:31 INFO - 'download_minidump_stackwalk': True, 04:34:31 INFO - 'download_symbols': 'ondemand', 04:34:31 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:34:31 INFO - 'tooltool.py': '/tools/tooltool.py', 04:34:31 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:34:31 INFO - '/tools/misc-python/virtualenv.py')}, 04:34:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:34:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:34:31 INFO - 'installer_path': 'installer.exe', 04:34:31 INFO - 'log_level': 'info', 04:34:31 INFO - 'log_name': 'talos', 04:34:31 INFO - 'log_to_console': True, 04:34:31 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:34:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:34:31 INFO - 'opt_config_files': (), 04:34:31 INFO - 'pip_index': False, 04:34:31 INFO - 'sps_profile': False, 04:34:31 INFO - 'sps_profile_interval': 0, 04:34:31 INFO - 'suite': 'dromaeojs-e10s', 04:34:31 INFO - 'system_bits': '32', 04:34:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:34:31 INFO - 'title': 'talos-linux64-ix-058', 04:34:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:34:31 INFO - 'use_talos_json': True, 04:34:31 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:34:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:34:31 INFO - 'work_dir': 'build'} 04:34:31 INFO - ##### 04:34:31 INFO - ##### Running clobber step. 04:34:31 INFO - ##### 04:34:31 INFO - Running pre-action listener: _resource_record_pre_action 04:34:31 INFO - Running main action method: clobber 04:34:31 INFO - rmtree: /builds/slave/test/build 04:34:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:34:32 INFO - Running post-action listener: _resource_record_post_action 04:34:32 INFO - ##### 04:34:32 INFO - ##### Running read-buildbot-config step. 04:34:32 INFO - ##### 04:34:32 INFO - Running pre-action listener: _resource_record_pre_action 04:34:32 INFO - Running main action method: read_buildbot_config 04:34:32 INFO - Using buildbot properties: 04:34:32 INFO - { 04:34:32 INFO - "project": "", 04:34:32 INFO - "product": "firefox", 04:34:32 INFO - "script_repo_revision": "production", 04:34:32 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 04:34:32 INFO - "repository": "", 04:34:32 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 04:34:32 INFO - "buildid": "20160506013623", 04:34:32 INFO - "pgo_build": "True", 04:34:32 INFO - "basedir": "/builds/slave/test", 04:34:32 INFO - "buildnumber": 252, 04:34:32 INFO - "slavename": "talos-linux64-ix-058", 04:34:32 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 04:34:32 INFO - "platform": "ubuntu64_hw", 04:34:32 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 04:34:32 INFO - "branch": "mozilla-aurora", 04:34:32 INFO - "repo_path": "releases/mozilla-aurora", 04:34:32 INFO - "revision": "b61ad3a6049cbcfe4945897e94b8d7ce5beb5c5f", 04:34:32 INFO - "stage_platform": "linux64-pgo", 04:34:32 INFO - "builduid": "3e330e94e72a44aabac68afc380e9ed1", 04:34:32 INFO - "slavebuilddir": "test" 04:34:32 INFO - } 04:34:32 INFO - Found installer url https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2. 04:34:32 INFO - Running post-action listener: _resource_record_post_action 04:34:32 INFO - ##### 04:34:32 INFO - ##### Running download-and-extract step. 04:34:32 INFO - ##### 04:34:32 INFO - Running pre-action listener: _resource_record_pre_action 04:34:32 INFO - Running main action method: download_and_extract 04:34:32 INFO - mkdir: /builds/slave/test/build/tests 04:34:32 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')]} 04:34:32 INFO - https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 04:34:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json 04:34:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json 04:34:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json 04:34:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 04:34:33 INFO - Downloaded 1361 bytes. 04:34:33 INFO - Reading from file /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.test_packages.json 04:34:33 INFO - Using the following test package requirements: 04:34:33 INFO - {u'common': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'], 04:34:33 INFO - u'cppunittest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 04:34:33 INFO - u'firefox-48.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 04:34:33 INFO - u'gtest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 04:34:33 INFO - u'firefox-48.0a2.en-US.linux-x86_64.gtest.tests.zip'], 04:34:33 INFO - u'jittest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 04:34:33 INFO - u'jsshell-linux-x86_64.zip'], 04:34:33 INFO - u'mochitest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 04:34:33 INFO - u'firefox-48.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 04:34:33 INFO - u'mozbase': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'], 04:34:33 INFO - u'reftest': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 04:34:33 INFO - u'firefox-48.0a2.en-US.linux-x86_64.reftest.tests.zip'], 04:34:33 INFO - u'talos': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 04:34:33 INFO - u'firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip'], 04:34:33 INFO - u'web-platform': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 04:34:33 INFO - u'firefox-48.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 04:34:33 INFO - u'xpcshell': [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 04:34:33 INFO - u'firefox-48.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 04:34:33 INFO - Downloading packages: [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:34:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:34:33 INFO - https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:34:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 04:34:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 04:34:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 04:34:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:34:35 INFO - Downloaded 23799377 bytes. 04:34:35 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:34:35 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 04:34:36 INFO - Return code: 0 04:34:36 INFO - Downloading packages: [u'firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 04:34:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:34:36 INFO - https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:34:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 04:34:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 04:34:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip 04:34:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:34:37 INFO - Downloaded 23799377 bytes. 04:34:37 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:34:37 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 04:34:38 INFO - Return code: 0 04:34:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:34:38 INFO - https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 04:34:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip 04:34:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip 04:34:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip 04:34:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 04:34:40 INFO - Downloaded 10840145 bytes. 04:34:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 04:34:40 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 04:34:40 INFO - Return code: 0 04:34: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')]} 04:34:40 INFO - https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 04:34:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 04:34:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 04:34:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 04:34:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 04:34:45 INFO - Downloaded 62706998 bytes. 04:34:45 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 04:34:45 INFO - mkdir: /builds/slave/test/properties 04:34:45 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:34:45 INFO - Writing to file /builds/slave/test/properties/build_url 04:34:45 INFO - Contents: 04:34:45 INFO - build_url:https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 04:34:46 INFO - Running post-action listener: _resource_record_post_action 04:34:46 INFO - Running post-action listener: set_extra_try_arguments 04:34:46 INFO - ##### 04:34:46 INFO - ##### Running populate-webroot step. 04:34:46 INFO - ##### 04:34:46 INFO - Running pre-action listener: _resource_record_pre_action 04:34:46 INFO - Running main action method: populate_webroot 04:34:46 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:34:46 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:34:46 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:34:46 INFO - '--tppagecycles', 04:34:46 INFO - '7'], 04:34:46 INFO - 'tests': ['tsvgm']}}, 04:34:46 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:34:46 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:34:46 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:34:46 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:34:46 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:34:46 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:34:46 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:34:46 INFO - 'talos_options': ['--disable-e10s'], 04:34:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:34:46 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:34:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:34:46 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:34:46 INFO - 'talos_options': ['--disable-e10s'], 04:34:46 INFO - 'tests': ['damp', 'tps']}, 04:34:46 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:34:46 INFO - 'tests': ['damp', 'tps']}, 04:34:46 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:34:46 INFO - 'tests': ['dromaeo_dom']}, 04:34:46 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:34:46 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:34:46 INFO - 'tests': ['a11yr', 04:34:46 INFO - 'ts_paint', 04:34:46 INFO - 'tpaint', 04:34:46 INFO - 'sessionrestore', 04:34:46 INFO - 'sessionrestore_no_auto_restore', 04:34:46 INFO - 'tabpaint']}, 04:34:46 INFO - 'other-e10s': {'tests': ['a11yr', 04:34:46 INFO - 'ts_paint', 04:34:46 INFO - 'tpaint', 04:34:46 INFO - 'sessionrestore', 04:34:46 INFO - 'sessionrestore_no_auto_restore', 04:34:46 INFO - 'tabpaint']}, 04:34:46 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:34:46 INFO - 'ts_paint', 04:34:46 INFO - 'tpaint', 04:34:46 INFO - 'sessionrestore', 04:34:46 INFO - 'sessionrestore_no_auto_restore', 04:34:46 INFO - 'tabpaint']}, 04:34:46 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:34:46 INFO - 'ts_paint', 04:34:46 INFO - 'tpaint', 04:34:46 INFO - 'sessionrestore', 04:34:46 INFO - 'sessionrestore_no_auto_restore', 04:34:46 INFO - 'tabpaint']}, 04:34:46 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:34:46 INFO - 'tests': ['a11yr', 04:34:46 INFO - 'ts_paint', 04:34:46 INFO - 'tpaint', 04:34:46 INFO - 'sessionrestore', 04:34:46 INFO - 'sessionrestore_no_auto_restore', 04:34:46 INFO - 'tabpaint']}, 04:34:46 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:34:46 INFO - 'tests': ['a11yr', 04:34:46 INFO - 'ts_paint', 04:34:46 INFO - 'tpaint', 04:34:46 INFO - 'sessionrestore', 04:34:46 INFO - 'sessionrestore_no_auto_restore', 04:34:46 INFO - 'tabpaint']}, 04:34:46 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:34:46 INFO - 'tests': ['tsvgx', 04:34:46 INFO - 'tsvgr_opacity', 04:34:46 INFO - 'tart', 04:34:46 INFO - 'tscrollx', 04:34:46 INFO - 'cart']}, 04:34:46 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:34:46 INFO - 'tsvgr_opacity', 04:34:46 INFO - 'tart', 04:34:46 INFO - 'tscrollx', 04:34:46 INFO - 'cart']}, 04:34:46 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:34:46 INFO - 'talos_options': ['--disable-e10s'], 04:34:46 INFO - 'tests': ['tp5o']}, 04:34:46 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:34:46 INFO - 'tests': ['tp5o']}, 04:34:46 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:34:46 INFO - 'talos_options': ['--disable-e10s', 04:34:46 INFO - '--xperf_path', 04:34:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:34:46 INFO - 'tests': ['tp5n']}, 04:34:46 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:34:46 INFO - 'talos_options': ['--xperf_path', 04:34:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:34:46 INFO - 'tests': ['tp5n']}}, 04:34:46 INFO - 'talos.zip': {'path': '', 04:34:46 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:34:46 INFO - Running post-action listener: _resource_record_post_action 04:34:46 INFO - ##### 04:34:46 INFO - ##### Running create-virtualenv step. 04:34:46 INFO - ##### 04:34:46 INFO - Running pre-action listener: _resource_record_pre_action 04:34:46 INFO - Running main action method: create_virtualenv 04:34:46 INFO - Creating virtualenv /builds/slave/test/build/venv 04:34:46 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 04:34:46 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:34:46 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:34:46 INFO - Using real prefix '/usr' 04:34:46 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:34:46 INFO - Installing distribute.............................................................................................................................................................................................done. 04:34:48 INFO - Installing pip.................done. 04:34:48 INFO - Return code: 0 04:34:48 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:34:48 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')]} 04:34:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:34:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:34:48 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')]} 04:34:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:34:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:34:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/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 0x7fa2f7b06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a685a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2af7410>, '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 0x2af8310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2af87a0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 04:34:48 INFO - Running command: ['/builds/slave/test/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/build 04:34:48 INFO - Copy/paste: /builds/slave/test/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 04:34:48 INFO - Using env: {'DISPLAY': ':0', 04:34:48 INFO - 'HOME': '/home/cltbld', 04:34:48 INFO - 'LANG': 'en_US.UTF-8', 04:34:48 INFO - 'LANGUAGE': 'en_US:en', 04:34:48 INFO - 'LOGNAME': 'cltbld', 04:34:48 INFO - 'MAIL': '/var/mail/cltbld', 04:34:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:34:48 INFO - 'MOZ_NO_REMOTE': '1', 04:34:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:34:48 INFO - 'NO_EM_RESTART': '1', 04:34:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:34:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:34:48 INFO - 'PWD': '/builds/slave/test', 04:34:48 INFO - 'SHELL': '/bin/bash', 04:34:48 INFO - 'SHLVL': '1', 04:34:48 INFO - 'TERM': 'linux', 04:34:48 INFO - 'TMOUT': '86400', 04:34:48 INFO - 'USER': 'cltbld', 04:34:48 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', 04:34:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:34:48 INFO - '_': '/tools/buildbot/bin/python'} 04:34:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:34: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 04:34:49 INFO - Cleaning up... 04:34:49 INFO - Return code: 0 04:34:49 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 04:34: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')]} 04:34:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:34:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:34: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')]} 04:34:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:34:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:34:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/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 0x7fa2f7b06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a685a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2af7410>, '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 0x2af8310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2af87a0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 04:34:49 INFO - Running command: ['/builds/slave/test/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/build 04:34:49 INFO - Copy/paste: /builds/slave/test/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 04:34:49 INFO - Using env: {'DISPLAY': ':0', 04:34:49 INFO - 'HOME': '/home/cltbld', 04:34:49 INFO - 'LANG': 'en_US.UTF-8', 04:34:49 INFO - 'LANGUAGE': 'en_US:en', 04:34:49 INFO - 'LOGNAME': 'cltbld', 04:34:49 INFO - 'MAIL': '/var/mail/cltbld', 04:34:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:34:49 INFO - 'MOZ_NO_REMOTE': '1', 04:34:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:34:49 INFO - 'NO_EM_RESTART': '1', 04:34:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:34:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:34:49 INFO - 'PWD': '/builds/slave/test', 04:34:49 INFO - 'SHELL': '/bin/bash', 04:34:49 INFO - 'SHLVL': '1', 04:34:49 INFO - 'TERM': 'linux', 04:34:49 INFO - 'TMOUT': '86400', 04:34:49 INFO - 'USER': 'cltbld', 04:34:49 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', 04:34:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:34:49 INFO - '_': '/tools/buildbot/bin/python'} 04:34:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:34:49 INFO - Downloading/unpacking psutil>=0.7.1 04:34: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 04:34: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 04:34: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 04:34: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 04:34: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 04:34: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 04:34:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:34:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:34:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:34:51 INFO - Installing collected packages: psutil 04:34:51 INFO - Running setup.py install for psutil 04:34:51 INFO - building 'psutil._psutil_linux' extension 04:34: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 04:34: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 04:34:51 INFO - building 'psutil._psutil_posix' extension 04:34:51 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 04:34:51 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 04:34:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:34:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:34:51 INFO - Successfully installed psutil 04:34:51 INFO - Cleaning up... 04:34:51 INFO - Return code: 0 04:34:51 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 04:34:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:34:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:34:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:34:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:34:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:34:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:34:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/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 0x7fa2f7b06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a685a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2af7410>, '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 0x2af8310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2af87a0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 04:34:51 INFO - Running command: ['/builds/slave/test/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/build 04:34:51 INFO - Copy/paste: /builds/slave/test/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 04:34:51 INFO - Using env: {'DISPLAY': ':0', 04:34:51 INFO - 'HOME': '/home/cltbld', 04:34:51 INFO - 'LANG': 'en_US.UTF-8', 04:34:51 INFO - 'LANGUAGE': 'en_US:en', 04:34:51 INFO - 'LOGNAME': 'cltbld', 04:34:51 INFO - 'MAIL': '/var/mail/cltbld', 04:34:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:34:51 INFO - 'MOZ_NO_REMOTE': '1', 04:34:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:34:51 INFO - 'NO_EM_RESTART': '1', 04:34:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:34:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:34:51 INFO - 'PWD': '/builds/slave/test', 04:34:51 INFO - 'SHELL': '/bin/bash', 04:34:51 INFO - 'SHLVL': '1', 04:34:51 INFO - 'TERM': 'linux', 04:34:51 INFO - 'TMOUT': '86400', 04:34:51 INFO - 'USER': 'cltbld', 04:34:51 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', 04:34:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:34:51 INFO - '_': '/tools/buildbot/bin/python'} 04:34:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:34:52 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 04:34: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 04:34: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 04:34: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 04:34: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 04:34: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 04:34: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 04:34:53 INFO - Downloading mozsystemmonitor-0.0.tar.gz 04:34:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:34: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) 04:34:54 INFO - Installing collected packages: mozsystemmonitor 04:34:54 INFO - Running setup.py install for mozsystemmonitor 04:34:54 INFO - Successfully installed mozsystemmonitor 04:34:54 INFO - Cleaning up... 04:34:54 INFO - Return code: 0 04:34:54 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:34: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')]} 04:34:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:34:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:34: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')]} 04:34:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:34:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:34:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/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 0x7fa2f7b06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a685a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2af7410>, '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 0x2af8310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2af87a0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 04:34:54 INFO - Running command: ['/builds/slave/test/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/build 04:34:54 INFO - Copy/paste: /builds/slave/test/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 04:34:54 INFO - Using env: {'DISPLAY': ':0', 04:34:54 INFO - 'HOME': '/home/cltbld', 04:34:54 INFO - 'LANG': 'en_US.UTF-8', 04:34:54 INFO - 'LANGUAGE': 'en_US:en', 04:34:54 INFO - 'LOGNAME': 'cltbld', 04:34:54 INFO - 'MAIL': '/var/mail/cltbld', 04:34:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:34:54 INFO - 'MOZ_NO_REMOTE': '1', 04:34:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:34:54 INFO - 'NO_EM_RESTART': '1', 04:34:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:34:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:34:54 INFO - 'PWD': '/builds/slave/test', 04:34:54 INFO - 'SHELL': '/bin/bash', 04:34:54 INFO - 'SHLVL': '1', 04:34:54 INFO - 'TERM': 'linux', 04:34:54 INFO - 'TMOUT': '86400', 04:34:54 INFO - 'USER': 'cltbld', 04:34:54 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', 04:34:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:34:54 INFO - '_': '/tools/buildbot/bin/python'} 04:34:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:34:54 INFO - Downloading/unpacking blobuploader==1.2.4 04:34: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 04:34: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 04:34: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 04:34: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 04:34: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 04:34: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 04:34:56 INFO - Downloading blobuploader-1.2.4.tar.gz 04:34:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:34:56 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:34: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 04:34: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 04:34: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 04:34: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 04:34: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 04:34: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 04:34:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:34:56 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:34: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 04:34: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 04:34: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 04:34: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 04:34: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 04:34: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 04:34:56 INFO - Downloading docopt-0.6.1.tar.gz 04:34:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:34:57 INFO - Installing collected packages: blobuploader, requests, docopt 04:34:57 INFO - Running setup.py install for blobuploader 04:34:57 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:34:57 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:34:57 INFO - Running setup.py install for requests 04:34:57 INFO - Running setup.py install for docopt 04:34:57 INFO - Successfully installed blobuploader requests docopt 04:34:57 INFO - Cleaning up... 04:34:57 INFO - Return code: 0 04:34:57 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:34: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')]} 04:34:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:34:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:34: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')]} 04:34:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:34:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:34:57 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/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 0x7fa2f7b06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a685a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2af7410>, '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 0x2af8310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2af87a0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 04:34:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/config 04:34:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/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 04:34:57 INFO - Using env: {'DISPLAY': ':0', 04:34:57 INFO - 'HOME': '/home/cltbld', 04:34:57 INFO - 'LANG': 'en_US.UTF-8', 04:34:57 INFO - 'LANGUAGE': 'en_US:en', 04:34:57 INFO - 'LOGNAME': 'cltbld', 04:34:57 INFO - 'MAIL': '/var/mail/cltbld', 04:34:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:34:57 INFO - 'MOZ_NO_REMOTE': '1', 04:34:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:34:57 INFO - 'NO_EM_RESTART': '1', 04:34:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:34:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:34:57 INFO - 'PWD': '/builds/slave/test', 04:34:57 INFO - 'SHELL': '/bin/bash', 04:34:57 INFO - 'SHLVL': '1', 04:34:57 INFO - 'TERM': 'linux', 04:34:57 INFO - 'TMOUT': '86400', 04:34:57 INFO - 'USER': 'cltbld', 04:34:57 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', 04:34:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:34:57 INFO - '_': '/tools/buildbot/bin/python'} 04:34:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:34:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:34:57 INFO - Running setup.py (path:/tmp/pip-v2AiYN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:34:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:34:57 INFO - Running setup.py (path:/tmp/pip-xIHSY_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:34:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:34:57 INFO - Running setup.py (path:/tmp/pip-gnHJry-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:34:58 INFO - Running setup.py (path:/tmp/pip-L7ra5w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:34:58 INFO - Running setup.py (path:/tmp/pip-xOZrUM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:34:58 INFO - Running setup.py (path:/tmp/pip-uLnrYf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:34:58 INFO - Running setup.py (path:/tmp/pip-bH1Wga-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:34:58 INFO - Running setup.py (path:/tmp/pip-wXLu3a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:34:58 INFO - Running setup.py (path:/tmp/pip-LBrCgZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:34:58 INFO - Running setup.py (path:/tmp/pip-38DwCn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:34:58 INFO - Running setup.py (path:/tmp/pip-sw5cLe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:34:58 INFO - Running setup.py (path:/tmp/pip-SEBQHQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:34:58 INFO - Running setup.py (path:/tmp/pip-xMPNsH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:34:58 INFO - Running setup.py (path:/tmp/pip-A3DhQ9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:34:58 INFO - Running setup.py (path:/tmp/pip-TgmbBG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:34:58 INFO - Running setup.py (path:/tmp/pip-cvm0bf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:34:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:34:58 INFO - Running setup.py (path:/tmp/pip-T6iII6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:34:59 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:34:59 INFO - Running setup.py install for manifestparser 04:34:59 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:34:59 INFO - Running setup.py install for mozcrash 04:34:59 INFO - Running setup.py install for mozdebug 04:34:59 INFO - Running setup.py install for mozdevice 04:34:59 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:34:59 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:34:59 INFO - Running setup.py install for mozfile 04:34:59 INFO - Running setup.py install for mozhttpd 04:34:59 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:34:59 INFO - Running setup.py install for mozinfo 04:34:59 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:34:59 INFO - Running setup.py install for mozInstall 04:34:59 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:34:59 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:34:59 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:34:59 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:34:59 INFO - Running setup.py install for mozleak 04:34:59 INFO - Running setup.py install for mozlog 04:35:00 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:35:00 INFO - Running setup.py install for moznetwork 04:35:00 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:35:00 INFO - Running setup.py install for mozprocess 04:35:00 INFO - Running setup.py install for mozprofile 04:35:00 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:35:00 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:35:00 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:35:00 INFO - Running setup.py install for mozrunner 04:35:00 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:35:00 INFO - Running setup.py install for mozscreenshot 04:35:00 INFO - Running setup.py install for moztest 04:35:00 INFO - Running setup.py install for mozversion 04:35:00 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:35:00 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:35:00 INFO - Cleaning up... 04:35:00 INFO - Return code: 0 04:35:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:35:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:35:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:35:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:35:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:35:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:35:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:35:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/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 0x7fa2f7b06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a685a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2af7410>, '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 0x2af8310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2af87a0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 04:35:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/config 04:35:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/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 04:35:00 INFO - Using env: {'DISPLAY': ':0', 04:35:00 INFO - 'HOME': '/home/cltbld', 04:35:00 INFO - 'LANG': 'en_US.UTF-8', 04:35:00 INFO - 'LANGUAGE': 'en_US:en', 04:35:00 INFO - 'LOGNAME': 'cltbld', 04:35:00 INFO - 'MAIL': '/var/mail/cltbld', 04:35:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:35:00 INFO - 'MOZ_NO_REMOTE': '1', 04:35:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:35:00 INFO - 'NO_EM_RESTART': '1', 04:35:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:35:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:35:00 INFO - 'PWD': '/builds/slave/test', 04:35:00 INFO - 'SHELL': '/bin/bash', 04:35:00 INFO - 'SHLVL': '1', 04:35:00 INFO - 'TERM': 'linux', 04:35:00 INFO - 'TMOUT': '86400', 04:35:00 INFO - 'USER': 'cltbld', 04:35:00 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', 04:35:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:35:00 INFO - '_': '/tools/buildbot/bin/python'} 04:35:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:35:01 INFO - Running setup.py (path:/tmp/pip-VJahul-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:35:01 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:35:01 INFO - Running setup.py (path:/tmp/pip-JhjMjj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:35:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:35:01 INFO - Running setup.py (path:/tmp/pip-WpE4yF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:35:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:35:01 INFO - Running setup.py (path:/tmp/pip-IpnY9d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:35:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:35:01 INFO - Running setup.py (path:/tmp/pip-9kyysL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:35:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:35:01 INFO - Running setup.py (path:/tmp/pip-HjfdRz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:35:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:35:01 INFO - Running setup.py (path:/tmp/pip-l2wTiU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:35:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:35:01 INFO - Running setup.py (path:/tmp/pip-nBZQKh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:35:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:35:01 INFO - Running setup.py (path:/tmp/pip-bLNC1B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:35:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:35:01 INFO - Running setup.py (path:/tmp/pip-YhmEVC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:35:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:35:01 INFO - Running setup.py (path:/tmp/pip-72gwXV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:35:01 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:35:01 INFO - Running setup.py (path:/tmp/pip-IMqhxi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:35:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 04:35:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:35:01 INFO - Running setup.py (path:/tmp/pip-2_h1Tj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:35:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 04:35:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:35:02 INFO - Running setup.py (path:/tmp/pip-cZ38W_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:35:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 04:35:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:35:02 INFO - Running setup.py (path:/tmp/pip-XlU5An-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:35:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 04:35:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:35:02 INFO - Running setup.py (path:/tmp/pip-ZLh7l7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:35:02 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 04:35:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:35:02 INFO - Running setup.py (path:/tmp/pip-QywI6p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:35:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 04:35:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:35:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:35:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:35:02 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:35:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:35:02 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:35: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 04:35: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 04:35: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 04:35: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 04:35: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 04:35: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 04:35:04 INFO - Downloading blessings-1.6.tar.gz 04:35:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:35:04 INFO - Installing collected packages: blessings 04:35:04 INFO - Running setup.py install for blessings 04:35:04 INFO - Successfully installed blessings 04:35:04 INFO - Cleaning up... 04:35:04 INFO - Return code: 0 04:35:04 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:35:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:35:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:35:04 INFO - Reading from file tmpfile_stdout 04:35:04 INFO - Current package versions: 04:35:04 INFO - argparse == 1.2.1 04:35:04 INFO - blessings == 1.6 04:35:04 INFO - blobuploader == 1.2.4 04:35:04 INFO - docopt == 0.6.1 04:35:04 INFO - manifestparser == 1.1 04:35:04 INFO - mozInstall == 1.12 04:35:04 INFO - mozcrash == 0.17 04:35:04 INFO - mozdebug == 0.1 04:35:04 INFO - mozdevice == 0.48 04:35:04 INFO - mozfile == 1.2 04:35:04 INFO - mozhttpd == 0.7 04:35:04 INFO - mozinfo == 0.9 04:35:04 INFO - mozleak == 0.1 04:35:04 INFO - mozlog == 3.1 04:35:04 INFO - moznetwork == 0.27 04:35:04 INFO - mozprocess == 0.22 04:35:04 INFO - mozprofile == 0.28 04:35:04 INFO - mozrunner == 6.11 04:35:04 INFO - mozscreenshot == 0.1 04:35:04 INFO - mozsystemmonitor == 0.0 04:35:04 INFO - moztest == 0.7 04:35:04 INFO - mozversion == 1.4 04:35:04 INFO - psutil == 3.1.1 04:35:04 INFO - requests == 1.2.3 04:35:04 INFO - wsgiref == 0.1.2 04:35:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:35: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')]} 04:35:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:35:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:35: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')]} 04:35:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:35:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:35:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/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 0x7fa2f7b06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a685a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2af7410>, '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 0x2af8310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2af87a0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 04:35:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/talos 04:35:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/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 04:35:04 INFO - Using env: {'DISPLAY': ':0', 04:35:04 INFO - 'HOME': '/home/cltbld', 04:35:04 INFO - 'LANG': 'en_US.UTF-8', 04:35:04 INFO - 'LANGUAGE': 'en_US:en', 04:35:04 INFO - 'LOGNAME': 'cltbld', 04:35:04 INFO - 'MAIL': '/var/mail/cltbld', 04:35:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:35:04 INFO - 'MOZ_NO_REMOTE': '1', 04:35:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:35:04 INFO - 'NO_EM_RESTART': '1', 04:35:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:35:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:35:04 INFO - 'PWD': '/builds/slave/test', 04:35:04 INFO - 'SHELL': '/bin/bash', 04:35:04 INFO - 'SHLVL': '1', 04:35:04 INFO - 'TERM': 'linux', 04:35:04 INFO - 'TMOUT': '86400', 04:35:04 INFO - 'USER': 'cltbld', 04:35:04 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', 04:35:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:35:04 INFO - '_': '/tools/buildbot/bin/python'} 04:35:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:35:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:35:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 04:35:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 04:35:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 04:35:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 04:35:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 04:35:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 04:35:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 04:35:04 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 04:35:04 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:35:04 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 04:35:04 INFO - Cleaning up... 04:35:04 INFO - Return code: 0 04:35:04 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:35: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')]} 04:35:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:35:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:35: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')]} 04:35:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:35:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:35:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/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 0x7fa2f7b06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a685a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2af7410>, '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 0x2af8310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2af87a0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 04:35:04 INFO - Running command: ['/builds/slave/test/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/build 04:35:04 INFO - Copy/paste: /builds/slave/test/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 04:35:04 INFO - Using env: {'DISPLAY': ':0', 04:35:04 INFO - 'HOME': '/home/cltbld', 04:35:04 INFO - 'LANG': 'en_US.UTF-8', 04:35:04 INFO - 'LANGUAGE': 'en_US:en', 04:35:04 INFO - 'LOGNAME': 'cltbld', 04:35:04 INFO - 'MAIL': '/var/mail/cltbld', 04:35:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:35:04 INFO - 'MOZ_NO_REMOTE': '1', 04:35:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:35:04 INFO - 'NO_EM_RESTART': '1', 04:35:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:35:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:35:04 INFO - 'PWD': '/builds/slave/test', 04:35:04 INFO - 'SHELL': '/bin/bash', 04:35:04 INFO - 'SHLVL': '1', 04:35:04 INFO - 'TERM': 'linux', 04:35:04 INFO - 'TMOUT': '86400', 04:35:04 INFO - 'USER': 'cltbld', 04:35:04 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', 04:35:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:35:04 INFO - '_': '/tools/buildbot/bin/python'} 04:35:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:35:05 INFO - Downloading/unpacking jsonschema 04:35: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 04:35: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 04:35: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 04:35: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 04:35: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 04:35: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 04:35:06 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:35:06 INFO - Downloading/unpacking functools32 (from jsonschema) 04:35: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 04:35: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 04:35: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 04:35: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 04:35: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 04:35: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 04:35:07 INFO - Downloading functools32-3.2.3-2.tar.gz 04:35:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:35:07 INFO - warning: no files found matching '*.txt' 04:35:07 INFO - no previously-included directories found matching 'build' 04:35:07 INFO - no previously-included directories found matching 'dist' 04:35:07 INFO - no previously-included directories found matching '.git*' 04:35:07 INFO - Installing collected packages: jsonschema, functools32 04:35:07 INFO - Running setup.py install for functools32 04:35:07 INFO - warning: no files found matching '*.txt' 04:35:07 INFO - no previously-included directories found matching 'build' 04:35:07 INFO - no previously-included directories found matching 'dist' 04:35:07 INFO - no previously-included directories found matching '.git*' 04:35:07 INFO - Successfully installed jsonschema functools32 04:35:07 INFO - Cleaning up... 04:35:07 INFO - Return code: 0 04:35:07 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 04:35: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')]} 04:35:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:35:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:35: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')]} 04:35:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:35:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:35:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/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 0x7fa2f7b06f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x299d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a685a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2af7410>, '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 0x2af8310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2af87a0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 04:35:07 INFO - Running command: ['/builds/slave/test/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/build 04:35:07 INFO - Copy/paste: /builds/slave/test/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 04:35:07 INFO - Using env: {'DISPLAY': ':0', 04:35:07 INFO - 'HOME': '/home/cltbld', 04:35:07 INFO - 'LANG': 'en_US.UTF-8', 04:35:07 INFO - 'LANGUAGE': 'en_US:en', 04:35:07 INFO - 'LOGNAME': 'cltbld', 04:35:07 INFO - 'MAIL': '/var/mail/cltbld', 04:35:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:35:07 INFO - 'MOZ_NO_REMOTE': '1', 04:35:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:35:07 INFO - 'NO_EM_RESTART': '1', 04:35:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:35:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:35:07 INFO - 'PWD': '/builds/slave/test', 04:35:07 INFO - 'SHELL': '/bin/bash', 04:35:07 INFO - 'SHLVL': '1', 04:35:07 INFO - 'TERM': 'linux', 04:35:07 INFO - 'TMOUT': '86400', 04:35:07 INFO - 'USER': 'cltbld', 04:35:07 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', 04:35:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:35:07 INFO - '_': '/tools/buildbot/bin/python'} 04:35:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:35:07 INFO - Downloading/unpacking flake8 04:35: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 04:35: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 04:35: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 04:35: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 04:35: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 04:35: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 04:35:09 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 04:35:09 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 04:35: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 04:35: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 04:35: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 04:35: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 04:35: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 04:35: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 04:35:09 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 04:35:09 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 04:35: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 04:35: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 04:35: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 04:35: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 04:35: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 04:35: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 04:35:10 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 04:35:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:35:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:35:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:35:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:35:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:35:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:35:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 04:35:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:35:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:35:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:35:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:35:10 INFO - no previously-included directories found matching 'docs/_build' 04:35:10 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 04:35:10 INFO - Running setup.py install for pep8 04:35:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:35:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:35:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:35:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:35:10 INFO - no previously-included directories found matching 'docs/_build' 04:35:10 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 04:35:10 INFO - Successfully installed flake8 mccabe pyflakes pep8 04:35:10 INFO - Cleaning up... 04:35:10 INFO - Return code: 0 04:35:10 INFO - Running post-action listener: _resource_record_post_action 04:35:10 INFO - Running post-action listener: _start_resource_monitoring 04:35:10 INFO - Starting resource monitoring. 04:35:10 INFO - ##### 04:35:10 INFO - ##### Running install step. 04:35:10 INFO - ##### 04:35:10 INFO - Running pre-action listener: _resource_record_pre_action 04:35:10 INFO - Running main action method: install 04:35:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:35:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:35:10 INFO - Reading from file tmpfile_stdout 04:35:10 INFO - Detecting whether we're running mozinstall >=1.0... 04:35:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:35:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:35:10 INFO - Reading from file tmpfile_stdout 04:35:10 INFO - Output received: 04:35:10 INFO - Usage: mozinstall [options] installer 04:35:10 INFO - Options: 04:35:10 INFO - -h, --help show this help message and exit 04:35:10 INFO - -d DEST, --destination=DEST 04:35:10 INFO - Directory to install application into. [default: 04:35:10 INFO - "/builds/slave/test"] 04:35:10 INFO - --app=APP Application being installed. [default: firefox] 04:35:10 INFO - mkdir: /builds/slave/test/build/application 04:35:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 04:35:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 04:35:26 INFO - Reading from file tmpfile_stdout 04:35:26 INFO - Output received: 04:35:26 INFO - /builds/slave/test/build/application/firefox/firefox 04:35:26 INFO - Running post-action listener: _resource_record_post_action 04:35:26 INFO - ##### 04:35:26 INFO - ##### Running run-tests step. 04:35:26 INFO - ##### 04:35:26 INFO - Running pre-action listener: _resource_record_pre_action 04:35:26 INFO - Running main action method: run_tests 04:35:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:35:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:35:26 INFO - Python 2.7.3 04:35:26 INFO - Return code: 0 04:35:26 INFO - grabbing minidump binary from tooltool 04:35: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')]} 04:35: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/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 0x2af7410>, '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 0x2af8310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2af87a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:35: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/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 04:35: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/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 04:35:26 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:35:26 INFO - Return code: 0 04:35:26 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:35:26 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:35:26 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:35:26 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:35:26 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:35:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 04:35:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 04:35:27 INFO - Return code: 0 04:35:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-058', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 04:35:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-058 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 04:35:27 INFO - Using env: {'DISPLAY': ':0', 04:35:27 INFO - 'HOME': '/home/cltbld', 04:35:27 INFO - 'LANG': 'en_US.UTF-8', 04:35:27 INFO - 'LANGUAGE': 'en_US:en', 04:35:27 INFO - 'LOGNAME': 'cltbld', 04:35:27 INFO - 'MAIL': '/var/mail/cltbld', 04:35:27 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:35:27 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:35:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:35:27 INFO - 'MOZ_NO_REMOTE': '1', 04:35:27 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:35:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:35:27 INFO - 'NO_EM_RESTART': '1', 04:35:27 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:35:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:35:27 INFO - 'PWD': '/builds/slave/test', 04:35:27 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:35:27 INFO - 'SHELL': '/bin/bash', 04:35:27 INFO - 'SHLVL': '1', 04:35:27 INFO - 'TERM': 'linux', 04:35:27 INFO - 'TMOUT': '86400', 04:35:27 INFO - 'USER': 'cltbld', 04:35:27 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178', 04:35:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:35:27 INFO - '_': '/tools/buildbot/bin/python'} 04:35:27 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-058', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 04:35:27 INFO - mozversion application_buildid: 20160506013623 04:35:27 INFO - mozversion application_changeset: b61ad3a6049cbcfe4945897e94b8d7ce5beb5c5f 04:35:27 INFO - mozversion application_display_name: FirefoxDeveloperEdition 04:35:27 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:35:27 INFO - mozversion application_name: Firefox 04:35:27 INFO - mozversion application_remotingname: firefox-dev 04:35:27 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 04:35:27 INFO - mozversion application_vendor: Mozilla 04:35:27 INFO - mozversion application_version: 48.0a2 04:35:27 INFO - mozversion platform_buildid: 20160506013623 04:35:27 INFO - mozversion platform_changeset: b61ad3a6049cbcfe4945897e94b8d7ce5beb5c5f 04:35:27 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 04:35:27 INFO - mozversion platform_version: 48.0a2 04:35:27 INFO - using testdate: 1462534527 04:35:27 INFO - actual date: 1462534527 04:35:27 INFO - starting webserver on 'localhost:55879' 04:35:27 INFO - SUITE-START | Running 2 tests 04:35:27 INFO - TEST-START | dromaeo_css 04:35:27 INFO - operating with platform_type : linux_ 04:35:27 INFO - Initialising browser for dromaeo_css test... 04:35:27 INFO - TEST-INFO | started process 23488 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpnBtuwP/profile http://localhost:55879/getInfo.html) 04:35:31 INFO - PROCESS | 23488 | 04:35:31 INFO - PROCESS | 23488 | (process:23566): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:35:32 INFO - PROCESS | 23488 | __metrics Screen width/height:1600/1200 04:35:32 INFO - PROCESS | 23488 | colorDepth:24 04:35:32 INFO - PROCESS | 23488 | Browser inner width/height: 1024/697 04:35:32 INFO - PROCESS | 23488 | __metrics 04:35:32 ERROR - PROCESS | 23488 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 04:35:33 INFO - TEST-INFO | 23488: exit 0 04:35:33 INFO - Browser initialized. 04:35:33 INFO - Running cycle 1/1 for dromaeo_css test... 04:35:33 INFO - TEST-INFO | started process 23617 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpnBtuwP/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:35:35 INFO - PROCESS | 23617 | 04:35:35 INFO - PROCESS | 23617 | (process:23683): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:35:45 INFO - PROCESS | 23617 | RSS: Main: 152174592 04:35:45 INFO - PROCESS | 23617 | 04:36:35 INFO - PROCESS | 23617 | 1462534595035 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] 04:38:42 INFO - PROCESS | 23617 | Cycle 1(1): loaded http://localhost:55879/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55879/tests/dromaeo/cssquery-ext.html) 04:38:43 INFO - PROCESS | 23617 | RSS: Main: 155938816 04:38:43 INFO - PROCESS | 23617 | 04:41:45 INFO - PROCESS | 23617 | Cycle 1(1): loaded http://localhost:55879/tests/dromaeo/cssquery-ext.html (next: http://localhost:55879/tests/dromaeo/cssquery-jquery.html) 04:41:46 INFO - PROCESS | 23617 | RSS: Main: 153964544 04:41:46 INFO - PROCESS | 23617 | 04:44:47 INFO - PROCESS | 23617 | Cycle 1(1): loaded http://localhost:55879/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55879/tests/dromaeo/cssquery-mootools.html) 04:44:48 INFO - PROCESS | 23617 | RSS: Main: 153550848 04:44:48 INFO - PROCESS | 23617 | 04:47:49 INFO - PROCESS | 23617 | Cycle 1(1): loaded http://localhost:55879/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55879/tests/dromaeo/cssquery-prototype.html) 04:47:50 INFO - PROCESS | 23617 | RSS: Main: 153288704 04:47:50 INFO - PROCESS | 23617 | 04:50:53 INFO - PROCESS | 23617 | Cycle 1(1): loaded http://localhost:55879/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55879/tests/dromaeo/cssquery-yui.html) 04:50:53 INFO - PROCESS | 23617 | RSS: Main: 154554368 04:50:53 INFO - PROCESS | 23617 | 04:53:55 INFO - PROCESS | 23617 | Cycle 1(1): loaded http://localhost:55879/tests/dromaeo/cssquery-yui.html (next: http://localhost:55879/tests/dromaeo/cssquery-dojo.html) 04:53:56 INFO - PROCESS | 23617 | RSS: Main: 156651520 04:53:56 INFO - PROCESS | 23617 | 04:53:56 INFO - PROCESS | 23617 | __start_tp_report 04:53:56 INFO - PROCESS | 23617 | _x_x_mozilla_page_load 04:53:56 INFO - PROCESS | 23617 | _x_x_mozilla_page_load_details 04:53:56 INFO - PROCESS | 23617 | |i|pagename|runs| 04:53:56 INFO - PROCESS | 23617 | |0;dojo.html;3351.832408379581;3396.72826173906;3410.7100896423804;3450.8102054387014;3452.9827350863256;5676.120201368789;5697.715114244282;5710.657360558364;5710.942890571098;5737.856553586163;5689.658620482774;5716.742746576404;5729.598928075036;5742.885142297151;5760.020796464601;5173.482651734834;5224.373075230958;5273.736313184345;5297.920531192035;5322.787088516455;5050.494950504957;5144.511271429208;5351.491608297206;5378.650387724805;5396.19057141428;5190.429052804188;5200.531952124308;5244.39689435716;5251.737413129347;5282.709450980195;5246.8688282792855;5248.737563121847;5302;5305.3898801637915;5327.147656374961;4944.53026962438;5069.569086627641;5116.462771408986;5170.327857378555;5177;5528.612997090206;5543.805966791143;5544.77820887164;5562.110062390038;5568;6040.516758659297;6049.062395328731;6064.36324185963;6075.544334174954;6093.817185484442;5909.113632955048;5960.195373624549;6049.727762250709;6104.389561043905;6128.050152226368;5736.655800651933;5740.56945729072;5742.282214723118;5747.885042299131;5749.396313387076;6242.250929888442;6244.37556244381;6245.156903818017;6245.313015568284;6251.562390632703;5909.261342332208;5985.461308482258;5985.730642121115;6010.459058684739;6018.518518518508;5959.910601340984;5986.5809393342915;5988.401159884064;5991.760329586855;5991.940080599138;5815.069588865761;5940.554458415636;5949.583529153005;5958.344582095966;5982.102684597258;6055.7274922628585;6063.211782468339;6065.120557519223;6085;6123.326434092246;4605.055963527536;4608.907821843544;4609.147307748078;4609.423822022247;4639.582437580634;4030.1133750574827;4047.5142982841658;4077.6941729370415;4131.318332475168;4139.965008747813;5776.653400795882;5778.191053252548;5805.390434004453;5843.561732870052;5933.970330148321;6052.425019623129;6061.424164704346;6092.603980741326;6109.938900611026;6109.961306577892;5660.150977353348;5766.94233057664;5827.562932780059;5839.357670656224;5862.267216597926;5223.503767142115;5225.738713064332;5227.686338819683;5251.343582052244;5254.474552544715;6339.207599050119;6339.587926784837;6355.3009168991375;6357.396047375492;6359.9364006360265;6005.429484199081;6103.8779224414375;6159.19930409044;6169.84575385619;6188.164597779242;6251.124842521959;6283.3716628338625;6291.433770960635;6291.716872740646;6315.242170939517;5906.940930590811;5971.253593300838;5980.491658209101;5984.102384642339;5999.220101386966;6024.728887199999;6055.031195008777;6098.573099883143;6099;6127.111568822585;5774.335951365647;5833.533317334688;5841.620294680833;5843.211166492639;5849.268841394825;5752.9137062943255;5783.219265399117;5822.73797679097;5827.76688932438;5948;5729.083346664514;5730.025895597842;5735.426457354231;5744.971275143597;5762.423757624204;5785.4214578541805;5844.211031510692;5857.58996870215;5877.382874798255;5882.823515294548;5735.852829434213;5771.249737534094;5782.913256301074;5791;5872.882542349214 04:53:56 INFO - PROCESS | 23617 | |1;ext.html;614.4285814192799;666.663335015817;672.1900110367009;674.5312008154332;678.4775722693527;33161.834190829046;39838.004049898766;40378;40757.184856302854;40757.592424075716;41783.79108104463;42023;42419;42631.14737705244;42722.7863860681;8660.220580147801;8798.736037918841;8841.823163536757;8858.247049000842;8886.777830554223;8708.042115367305;8796;8808.20726134651;8814.33892458065;9047.773805654846;9063.637454501812;9081.409708368968;9116.954415227949;9121.635134594608;9139.68011119611;8998.100189980982;9035.367524273304;9047.7285681429;9081.50051747157;9093.13615206561;9033;9108.043655416219;9141.360104792668;9151.679691210775;9167.174954254082;43528.78235608801;43706.78146609246;43911.56088439107;44016.55983440189;44078.33882491765;3723.1622884850963;3877.6406693023464;3902.5902280260448;3954.5649978502342;4189.556353251496;33220.667793322;33290;33479.832600837086;33666.663333366596;35193.47209791855;4507.481639611454;4514.5936865681915;4535.297028960516;4571.994161284545;4625.653076019312;222417;222648;222661;222953;224676;55503.44496555063;61221.69389153115;61419.23613437406;61448.69275653593;61495.69252153711;73852.63073684704;74953.62523187349;75500;75867;75892.62053689697;18015.63968720618;18032.549186270186;18051.27794888216;18140.183691733902;18314.725279120823;14596.489122880648;14643;14735.852641473663;14765.187914664582;14791.038582492103;20444.773313601232;20745;20821.583568328548;20909.58180836405;20924.16303347849;7747.38020958322;7756.767296980986;7792.2986931176465;7858.803529911798;7882;1138.7210133517176;1166.4809159923923;1199.0707201918583;1210.922279171538;1224.5836415618733;33175.004749857544;33515.66484335174;33611.495827562605;33720;34217.65782342145;1282.2178471132602;1295.2875918245115;1305.3081866610712;1309.7838856588746;1321.1940716163133;16814;17524.247575242374;17574.736378954327;17657;17775.288988440316;459436;505331.42002869985;510838;512451;523732;56778;57572;57607;57980.71009644925;58196.709016454646;1540.8767298616083;1541.2910061371895;1543.930523126462;1545.5131633535625;1643.005981381271;32850.34299314048;33036.834815825765;33715.325693486484;33975.830120849234;34083.65916340805;52722;53350;53388.73305633447;53401;53532.73233633807;419295;419421;420953;421442;422212;30668.846655766578;30866;31448.056558303288;31565.526517101804;31643;49451.752741237506;50646;51578;51585.22622160595;52965;37705.43441848319;38262.42606360962;38699.41950870796;38724;38732.6126738729;37354.8132259337;37674.81162594169;38539.42190867195;38826;39104.608953911236;39550.80224598858;39737.60262397339;39948.80025599853;40291.39562906617;40295.1940961185;34333.656663433045;36104.35650979903;36964.81517592395;37114.628853712195;37450.625493744716;28839.279018024718;28871.56692649654;29054.994432957366;29415.55876661809;29604.259893501974 04:53:56 INFO - PROCESS | 23617 | |2;jquery.html;419.58880297308644;428.06895003367686;428.96997210195286;434.4048653344918;437.0646815814158;18529.722054169182;19175;19208.807911920892;19379;20025.399238022845;19598.31405900794;19827;20254.797452025476;20323.288684896033;20444.59110817783;5274.81538146164;5316.813911513098;5425.6202065855405;5450.209719590657;5516.393196748354;5389.029974604569;5436.972815135919;5447.1829225616075;5472.20653005314;5508.20131080993;5477.123660214346;5480.698561579112;5482.91775623366;5504.862378440531;5777.508911742486;5666.093425051992;5673.517750991171;5698.629589076718;5702.942970570282;5742.7415766290615;5523.972380138073;5786.392428795;5791.507721843648;5798.855028624276;5813.186153938452;13517.864821351759;13585.660358491017;13839.30803459833;14508.927455362762;14540.491082812157;2576.4541275234897;2627.881745321465;2728.154272175632;3155.826429546374;3164.6360668522952;9848.310618256653;10410.635627752992;10545.84181237282;10551.15590752738;10639.946800265949;2040.877547347164;2047.7133201351824;2057.989710051455;2086.499240182345;2151.7202763640626;81953.59023204906;84713.15286847176;87907;88248;88424;11409.48657310423;11519;12091;12280.631581052583;12421.19262247951;16367.099809510592;16455.506334809976;16501.58746031359;16531.090790006423;16534.255958481896;8831.425957312882;8984.55077246135;9045.954770226106;9247.630094796268;9256.074392560824;8901.599428025755;8918.152775486318;9002.86495702565;9133.771655708528;9174.724758257264;4896.779644915988;5077.822276220315;5079.339685840817;5085.601459598566;5123.487651234921;2036.9019909493245;2086.874787512754;2097.538541520863;2124.8193903518063;2141.864811649828;487.39319547164007;1041.3283432186197;1145.2098052343856;1154.2901115813713;1167.9065674746;10694.839577406345;12318.137730358789;12377.814332785016;12422.440990155465;12436.81344779829;502.3921055522785;506.72890003847766;507.8222622082242;514.1311184098861;533.280071902928;6574.835629109215;6711.463082953352;6796.422304104207;6831;6847.452203823682;521560;522989;524979;535078;541517;87803;91652.08347916436;91904;91966.54016730007;94518.58222126674;505.00261982584834;509.1192237429194;512.684698910175;512.7231295100678;513.933188685476;11094.556217751522;11310.151738619472;11453;11499.080073593925;11559.653210403701;36667;38585.2282954345;38953.610463895;39285.80357098196;39406;56123.719381404466;58317.4168258312;58831;59129.40870591239;59177;8696.21734043939;9257.722268331692;9277.396969196981;9389.061093890556;9498.667546635834;13080.607581772561;13221.933890330487;14238.644033898821;14256;14697.779533307223;12357.25856448616;12557.497700091893;12628.179168354027;13087.869121309046;13120.081594288307;6601.9009714853355;10307;12179.208351457128;12543.817718291863;12614.117011809085;12908.935455323039;13052.608421747364;13166.341682915625;13366;13659.248741318925;8906.198442140238;9395.812083758423;9467;9514.762130946781;9821.361611495517;12148.149629526202;12190.756184876076;12191.390430478617;12253.816192756938;12314.261144331369 04:53:56 INFO - PROCESS | 23617 | |3;mootools.html;1579.4156162219979;1609.1632351177389;1793.8833975791572;1879.6334714730633;1913.6651086059944;7689.346405555534;8380.45527040742;8432.620532076056;8634.222919937212;8645;7473.4394920381055;8111.986001749781;8142.145074767153;8206.589670516465;8345.374096942724;2369.478714682767;2373.643953406994;2391.3977634984603;2397.7961873240797;2398.0527691561824;2376.9049238030457;2397.3167647220544;2413.9981907508363;2440.2069327468553;2440.9511809763794;2385.403649087728;2404.627282771173;2428.538577670246;2462.987685061581;2465.4206261528525;2415.6014257647553;2428.562858685436;2428.8785560721894;2441.3164313991933;2453.987730061347;2411.3127758588894;2421.9273421797197;2423.575874222022;2423.903043878243;2425.927222183337;8617.827643447159;8659.48043117415;8661.870071948926;8703.608337624823;8729.956350218272;5360.839174824722;5424.972875135599;5454.890902181974;5470.206820011116;5486.533644640211;3315;3368.1579605098727;3374.240795820945;3398.507216453625;3398.8130652814084;1065.1478816946412;1082.884628832304;1089.215764649451;1111.2388014210292;1127.0532752487868;12303.630891073282;12319.260844349368;12330.938345308306;12331;12331.383430828513;4535.7732113394195;4593.379893714306;4645.419322584677;4705.95294047062;4747.786349614275;10415;10431.94784026075;10438.68683939483;10477.68566942993;10501.107405870434;5422.945770542323;5468.562514998791;5471.042567550663;5479.53423958968;5485.807996720096;4463.375127482155;4877.68295060827;4934.703917764946;4953.281774142729;4994.500549944976;4039.6768258539246;4083.9183216335505;4108.876733697994;4134.441850350225;4153.293940030202;1322.7619028574757;1339.3571085878832;1355.4578168732585;1364.1761553584183;1365.0649305225952;926.9304802139867;1014.6651604970342;1032.4528000159928;1040.8959104089531;1041.401194313273;5730.111832665943;5791.739371728282;5797.507211886952;5902.144189092557;5910.408959104141;437.71111066696466;445.125328729049;445.70360710127403;446.34164607204116;447.7089891570505;3878.2852003597595;3909.3940439231965;3911.4523966644692;3955.1891862168186;4014.297497937849;10459.529321180566;10877.564897404016;10942.726431839268;10984.835227471594;11052.447377631248;10329.12202462784;10752.462376881125;10836.295640783324;10867.076298514557;10883.074938630147;8124.7562573122905;8125.512469251746;8239.764035394739;8251;8314.334853211849;5726.141078838207;5813.09896965971;5845.707714614167;5853.531717462678;5881.2734658248855;9484.288678349014;9533.952330238304;9561.378510396802;9709.465979371202;9748.463834488888;9593.664221752206;9697.6120955161;9791;9793.412395256308;10089.646862359783;6567.9014814776865;7265.527740696838;7361.8159546011775;7593.430492712958;7600.543967361976;8149;8189.058258300372;8200.712975045844;8214.096449390443;8232.958835205785;7322.780316590511;7540.396768258636;7576.7348142814735;7618.580978046039;7622.199669034671;7330.816729581803;7395.482316237812;7433.145188303198;7484.401247900264;7507.136679281734;7008.369246767816;7033.9296607033275;7073.752418665322;7076.0801095857205;7103.50275480732;5013.373328333958;5020.824271150492;5157.510036546522;5163.741812909415;5170;4916.7541622919425;5036.093503169464;5041.924371134362;5091.414487334004;5231.712255825966 04:53:56 INFO - PROCESS | 23617 | |4;prototype.html;356.4403885899136;357.171362439141;359.13627725320595;361.13688284998847;363.5219686112762;6662.600243985365;6670.966645166774;6680.933190668092;6695.598264104157;6725.798226053214;6628.502862285324;6630.03864439656;6638.50211234157;6640.435562977141;6656.2012558492925;4779.1397548441355;4868.342773725555;5023.146065168912;5034.270030845525;5055.811884207208;5005.324281222025;5035.446100928895;5042.571381432583;5046.646734728571;5056.949430505703;4965.031818795336;4973.925391119136;4989.950100499003;5000.0999820032375;5007.924881126786;4994.77523511441;5011.223260394645;5011.799528018875;5019.272205530177;5023.799048038074;4401.955980440187;4407.955920440787;4411.558844115595;4412.514623391425;4417.845375411877;6168.414000669929;6366.172397588284;6405.423511883906;6430.7106180222;6432.678366081724;5721;5734.827955161351;5760.884782304331;5772.624779389326;5775.162601422812;6984.546004509691;6992.54548454354;7000.5099643025005;7006.264342244042;7010.439164866799;4719.740414277213;4731.976340118312;4732.810687572493;4733.455652599961;4736.763161841928;7207.675654595609;7296.525725827804;7300.671469783872;7344.669489872915;7364.815879602999;4839.588634966068;4847.636427267969;4852.927206091911;4862.586680132228;4868.172410690191;4886.755662216946;4898.2652602109965;4915.631327650441;4919.1391506486225;4922.458529561745;5710;5712.343080545707;5713.514351280188;5714.142878568248;5725.570582206351;6952.652367381611;7011.754588589375;7023.262557431396;7031.542949708252;7035.859282814315;1720.5354554270277;1729.0317422243331;1737.2095696458082;1742.5904912345588;1745.7555942168106;1073.6188653028219;1115.520326259716;1126.1666366888444;1132.7281452451352;1134.444122380028;6659.433948114368;6745.898811517831;6763.5265531413315;6785.1518560179975;6785.355391237825;7103.467239957024;7142.392896603743;7195.100612423447;7199.2080871104135;7341.3392794648735;6906.827329316808;6915.377616014483;6921.134858142732;6921.93078069223;6926.134233220848;3911.9804400977814;3957.406389041667;3977.463042489285;3986.621270979252;3988.2821092203103;7598.696052157962;7656.61716914152;7664.770056898302;7687.192844751333;7689.19263477338;7356.926430735732;7451.739189128354;7492.737754178577;7513.2862378074;7519.135299440525;7602.543847369176;7618.504797188165;7627.771166865003;7657.119431265364;7678.308952194217;7323.304286092813;7329.816754581178;7338.559686418832;7342.449316301192;7348.926510735038;7165.140183178052;7201.855962880818;7208.098987626547;7233.782986510413;7254.5647261164495;7214.278572142954;7522.398208143226;7537.849243014999;7544.585047822203;7601.505902116566;4839.903201935871;4860;4875.3174555562955;4880.072786170616;4884.63365247615;7189.7483588074165;7246.311600397954;7251.274872512707;7268.454865884974;7278.235785242685;7023.508354415142;7075.186353569406;7087.50387472872;7092.645367731696;7106.076210092655;6883.8967415487805;7011.719531218898;7068.6112263823925;7082.114735658043;7101.715931362688;6960.651967401711;6964.756233532004;6965.860682786215;6969.442444604318;6970.581765094111;7104.289571042855;7125.786226413215;7139.357457828821;7158.248383919614;7159.498835081495;6858.6570671467225;6959.130108736408;6986.091808065123;6989.0564773754895;6994.370506654425 04:53:56 INFO - PROCESS | 23617 | |5;yui.html;809.3363441977581;840.9621567029479;915.9129882661146;921.2353746390496;928.8049509602984;15063;15207.771883421758;15210;15254.847451525482;15255.160966146857;14360.353784079716;15107.77338339923;15339.769903451457;15383.69232615347;15385.846141538581;751.9248075192492;884.7257350221436;891.7859713668705;899.9370044096916;917.7889085510336;890.844102282098;892.0499667853747;892.3887137310962;895.6686026170327;899.7795540092653;947.3415975896754;949.1220620925651;951.4101257220533;956.1060408518023;956.7608097975506;945.0643862576035;945.4516380499294;947.1286416496771;948.8481842905137;949.586929685589;699.105145413871;699.3111784891928;700.0304578159236;700.422151724824;703.3669697272445;14897.627559310995;14915.701685966329;14923.701525969529;15039.699206015928;15077.396904123822;14809.925950370287;14956.40174393023;15046.774298385424;15231.543053708407;15363.539093827203;11913.761724765543;12007.879921200763;12112.454939527743;12325.260484370967;12379.566715164927;4078.4290199372113;4078.775667338295;4171.561985991488;4250.617444430016;4254.340577210537;56065.719671401384;57150;57190.14214786782;58680.41319586835;59455.81088378251;11251.943740281245;11384.373859437645;11408.657740267805;11483.13876459269;11565.074794016627;17533.912330438267;17763.46709598688;17767.46697599074;17806.198721057583;20537;8860.778480537909;9022.503762293005;9052.773680657905;9070.319726020574;9084.772880678036;5037.11850426174;5120.667156634807;5145.845624631267;5197.7401129943355;5286.550643195372;3654.5979942206336;3713.8885833425043;3724.273766615538;3727.9440808387894;3732.4401339798706;631.4537924695197;644.3524258120559;646.8641585267053;652.9020646903002;655.2235600812957;727.1782885339638;734.474850481908;739.3863093632273;741.6551303643831;756.5687558091835;9492.857607135898;9535.114731300315;9887.357321774061;9896.505174741234;9916.405015699082;720.7549433192635;728.4864170759602;739.5710487916995;759.3128218961848;794.9244821741926;4366.563343665608;4399.252127138394;4541.182587134282;4555.088982203572;4613.2388155953895;61051.69474152601;61170.38829611647;64447.67776161089;64455.67772161203;64545;54890.45109548853;57005.42994570084;57150.428495714514;58284.41715582875;58551.4144858546;50865;51476;51694.67373968105;52020.47979520232;52597.474025260024;7693.730719424793;8004.919950800418;8373.120822313813;8802.86795698078;8927.642894284156;38032.42951355787;38343.61656383512;38511;38734;39898.60101399065;45371.319430207914;47724;48330.516694834005;48962.26556601725;49237;11321.377324247245;11462.369569673414;11542.19204655666;11600.941995290306;11727.706807329885;11812.881871181178;12754.68113297175;12809.551665692028;13148.474061037834;13368.398422071225;12406.379681015733;12474.625761227178;12521.87478125207;12532.624021279376;12678.112532122663;12400.31798251105;12489.562865300035;12656.430460629477;12717;12763.298018609066;12233.388330583613;12441.813372799596;12567.748645026866;12620.684482887635;12630.684232894251;9956.153726933291;9966.252531060345;10089.747756306151;10132.898671013196;10297.124744396511;10041.447720375449;10046.146077583195;10426.530806113591;10430.165586753194;10452.843207351743 04:53:56 INFO - PROCESS | 23617 | __end_tp_report 04:53:56 INFO - PROCESS | 23617 | __start_cc_report 04:53:56 INFO - PROCESS | 23617 | _x_x_mozilla_cycle_collect,329 04:53:56 INFO - PROCESS | 23617 | __end_cc_report 04:53:56 INFO - PROCESS | 23617 | __startTimestamp1462535635994__endTimestamp 04:53:56 INFO - PROCESS | 23617 | 04:53:56 INFO - PROCESS | 23617 | ------- Summary: start ------- 04:53:56 INFO - PROCESS | 23617 | Number of tests: 6 04:53:56 INFO - PROCESS | 23617 | 04:53:56 INFO - PROCESS | 23617 | [#0] dojo.html Cycles:165 Average:5638.78 Median:5805.39 stddev:620.93 (10.7%) stddev-sans-first:596.36 04:53:56 INFO - PROCESS | 23617 | Values: 3351.8 3396.7 3410.7 3450.8 3453.0 5676.1 5697.7 5710.7 5710.9 5737.9 5689.7 5716.7 5729.6 5742.9 5760.0 5173.5 5224.4 5273.7 5297.9 5322.8 5050.5 5144.5 5351.5 5378.7 5396.2 5190.4 5200.5 5244.4 5251.7 5282.7 5246.9 5248.7 5302.0 5305.4 5327.1 4944.5 5069.6 5116.5 5170.3 5177.0 5528.6 5543.8 5544.8 5562.1 5568.0 6040.5 6049.1 6064.4 6075.5 6093.8 5909.1 5960.2 6049.7 6104.4 6128.1 5736.7 5740.6 5742.3 5747.9 5749.4 6242.3 6244.4 6245.2 6245.3 6251.6 5909.3 5985.5 5985.7 6010.5 6018.5 5959.9 5986.6 5988.4 5991.8 5991.9 5815.1 5940.6 5949.6 5958.3 5982.1 6055.7 6063.2 6065.1 6085.0 6123.3 4605.1 4608.9 4609.1 4609.4 4639.6 4030.1 4047.5 4077.7 4131.3 4140.0 5776.7 5778.2 5805.4 5843.6 5934.0 6052.4 6061.4 6092.6 6109.9 6110.0 5660.2 5766.9 5827.6 5839.4 5862.3 5223.5 5225.7 5227.7 5251.3 5254.5 6339.2 6339.6 6355.3 6357.4 6359.9 6005.4 6103.9 6159.2 6169.8 6188.2 6251.1 6283.4 6291.4 6291.7 6315.2 5906.9 5971.3 5980.5 5984.1 5999.2 6024.7 6055.0 6098.6 6099.0 6127.1 5774.3 5833.5 5841.6 5843.2 5849.3 5752.9 5783.2 5822.7 5827.8 5948.0 5729.1 5730.0 5735.4 5745.0 5762.4 5785.4 5844.2 5857.6 5877.4 5882.8 5735.9 5771.2 5782.9 5791.0 5872.9 04:53:56 INFO - PROCESS | 23617 | 04:53:56 INFO - PROCESS | 23617 | [#1] ext.html Cycles:180 Average:56117.37 Median:40336.60 stddev:106020.98 (262.8%) stddev-sans-first:106236.50 04:53:56 INFO - PROCESS | 23617 | Values: 614.4 666.7 672.2 674.5 678.5 33161.8 39838.0 40378.0 40757.2 40757.6 41783.8 42023.0 42419.0 42631.1 42722.8 8660.2 8798.7 8841.8 8858.2 8886.8 8708.0 8796.0 8808.2 8814.3 9047.8 9063.6 9081.4 9117.0 9121.6 9139.7 8998.1 9035.4 9047.7 9081.5 9093.1 9033.0 9108.0 9141.4 9151.7 9167.2 43528.8 43706.8 43911.6 44016.6 44078.3 3723.2 3877.6 3902.6 3954.6 4189.6 33220.7 33290.0 33479.8 33666.7 35193.5 4507.5 4514.6 4535.3 4572.0 4625.7 222417.0 222648.0 222661.0 222953.0 224676.0 55503.4 61221.7 61419.2 61448.7 61495.7 73852.6 74953.6 75500.0 75867.0 75892.6 18015.6 18032.5 18051.3 18140.2 18314.7 14596.5 14643.0 14735.9 14765.2 14791.0 20444.8 20745.0 20821.6 20909.6 20924.2 7747.4 7756.8 7792.3 7858.8 7882.0 1138.7 1166.5 1199.1 1210.9 1224.6 33175.0 33515.7 33611.5 33720.0 34217.7 1282.2 1295.3 1305.3 1309.8 1321.2 16814.0 17524.2 17574.7 17657.0 17775.3 459436.0 505331.4 510838.0 512451.0 523732.0 56778.0 57572.0 57607.0 57980.7 58196.7 1540.9 1541.3 1543.9 1545.5 1643.0 32850.3 33036.8 33715.3 33975.8 34083.7 52722.0 53350.0 53388.7 53401.0 53532.7 419295.0 419421.0 420953.0 421442.0 422212.0 30668.8 30866.0 31448.1 31565.5 31643.0 49451.8 50646.0 51578.0 51585.2 52965.0 37705.4 38262.4 38699.4 38724.0 38732.6 37354.8 37674.8 38539.4 38826.0 39104.6 39550.8 39737.6 39948.8 40291.4 40295.2 34333.7 36104.4 36964.8 37114.6 37450.6 28839.3 28871.6 29055.0 29415.6 29604.3 04:53:56 INFO - PROCESS | 23617 | 04:53:56 INFO - PROCESS | 23617 | [#2] jquery.html Cycles:180 Average:29676.42 Median:435.73 stddev:87215.72 (20015.8%) stddev-sans-first:87432.71 04:53:56 INFO - PROCESS | 23617 | Values: 419.6 428.1 429.0 434.4 437.1 18529.7 19175.0 19208.8 19379.0 20025.4 19598.3 19827.0 20254.8 20323.3 20444.6 5274.8 5316.8 5425.6 5450.2 5516.4 5389.0 5437.0 5447.2 5472.2 5508.2 5477.1 5480.7 5482.9 5504.9 5777.5 5666.1 5673.5 5698.6 5702.9 5742.7 5524.0 5786.4 5791.5 5798.9 5813.2 13517.9 13585.7 13839.3 14508.9 14540.5 2576.5 2627.9 2728.2 3155.8 3164.6 9848.3 10410.6 10545.8 10551.2 10639.9 2040.9 2047.7 2058.0 2086.5 2151.7 81953.6 84713.2 87907.0 88248.0 88424.0 11409.5 11519.0 12091.0 12280.6 12421.2 16367.1 16455.5 16501.6 16531.1 16534.3 8831.4 8984.6 9046.0 9247.6 9256.1 8901.6 8918.2 9002.9 9133.8 9174.7 4896.8 5077.8 5079.3 5085.6 5123.5 2036.9 2086.9 2097.5 2124.8 2141.9 487.4 1041.3 1145.2 1154.3 1167.9 10694.8 12318.1 12377.8 12422.4 12436.8 502.4 506.7 507.8 514.1 533.3 6574.8 6711.5 6796.4 6831.0 6847.5 521560.0 522989.0 524979.0 535078.0 541517.0 87803.0 91652.1 91904.0 91966.5 94518.6 505.0 509.1 512.7 512.7 513.9 11094.6 11310.2 11453.0 11499.1 11559.7 36667.0 38585.2 38953.6 39285.8 39406.0 56123.7 58317.4 58831.0 59129.4 59177.0 8696.2 9257.7 9277.4 9389.1 9498.7 13080.6 13221.9 14238.6 14256.0 14697.8 12357.3 12557.5 12628.2 13087.9 13120.1 6601.9 10307.0 12179.2 12543.8 12614.1 12908.9 13052.6 13166.3 13366.0 13659.2 8906.2 9395.8 9467.0 9514.8 9821.4 12148.1 12190.8 12191.4 12253.8 12314.3 04:53:56 INFO - PROCESS | 23617 | 04:53:56 INFO - PROCESS | 23617 | [#3] mootools.html Cycles:180 Average:5720.42 Median:4812.73 stddev:3209.66 (66.7%) stddev-sans-first:3203.58 04:53:56 INFO - PROCESS | 23617 | Values: 1579.4 1609.2 1793.9 1879.6 1913.7 7689.3 8380.5 8432.6 8634.2 8645.0 7473.4 8112.0 8142.1 8206.6 8345.4 2369.5 2373.6 2391.4 2397.8 2398.1 2376.9 2397.3 2414.0 2440.2 2441.0 2385.4 2404.6 2428.5 2463.0 2465.4 2415.6 2428.6 2428.9 2441.3 2454.0 2411.3 2421.9 2423.6 2423.9 2425.9 8617.8 8659.5 8661.9 8703.6 8730.0 5360.8 5425.0 5454.9 5470.2 5486.5 3315.0 3368.2 3374.2 3398.5 3398.8 1065.1 1082.9 1089.2 1111.2 1127.1 12303.6 12319.3 12330.9 12331.0 12331.4 4535.8 4593.4 4645.4 4706.0 4747.8 10415.0 10431.9 10438.7 10477.7 10501.1 5422.9 5468.6 5471.0 5479.5 5485.8 4463.4 4877.7 4934.7 4953.3 4994.5 4039.7 4083.9 4108.9 4134.4 4153.3 1322.8 1339.4 1355.5 1364.2 1365.1 926.9 1014.7 1032.5 1040.9 1041.4 5730.1 5791.7 5797.5 5902.1 5910.4 437.7 445.1 445.7 446.3 447.7 3878.3 3909.4 3911.5 3955.2 4014.3 10459.5 10877.6 10942.7 10984.8 11052.4 10329.1 10752.5 10836.3 10867.1 10883.1 8124.8 8125.5 8239.8 8251.0 8314.3 5726.1 5813.1 5845.7 5853.5 5881.3 9484.3 9534.0 9561.4 9709.5 9748.5 9593.7 9697.6 9791.0 9793.4 10089.6 6567.9 7265.5 7361.8 7593.4 7600.5 8149.0 8189.1 8200.7 8214.1 8233.0 7322.8 7540.4 7576.7 7618.6 7622.2 7330.8 7395.5 7433.1 7484.4 7507.1 7008.4 7033.9 7073.8 7076.1 7103.5 5013.4 5020.8 5157.5 5163.7 5170.0 4916.8 5036.1 5041.9 5091.4 5231.7 04:53:56 INFO - PROCESS | 23617 | 04:53:56 INFO - PROCESS | 23617 | [#4] prototype.html Cycles:180 Average:5874.36 Median:6735.85 stddev:1808.72 (26.9%) stddev-sans-first:1765.74 04:53:56 INFO - PROCESS | 23617 | Values: 356.4 357.2 359.1 361.1 363.5 6662.6 6671.0 6680.9 6695.6 6725.8 6628.5 6630.0 6638.5 6640.4 6656.2 4779.1 4868.3 5023.1 5034.3 5055.8 5005.3 5035.4 5042.6 5046.6 5056.9 4965.0 4973.9 4990.0 5000.1 5007.9 4994.8 5011.2 5011.8 5019.3 5023.8 4402.0 4408.0 4411.6 4412.5 4417.8 6168.4 6366.2 6405.4 6430.7 6432.7 5721.0 5734.8 5760.9 5772.6 5775.2 6984.5 6992.5 7000.5 7006.3 7010.4 4719.7 4732.0 4732.8 4733.5 4736.8 7207.7 7296.5 7300.7 7344.7 7364.8 4839.6 4847.6 4852.9 4862.6 4868.2 4886.8 4898.3 4915.6 4919.1 4922.5 5710.0 5712.3 5713.5 5714.1 5725.6 6952.7 7011.8 7023.3 7031.5 7035.9 1720.5 1729.0 1737.2 1742.6 1745.8 1073.6 1115.5 1126.2 1132.7 1134.4 6659.4 6745.9 6763.5 6785.2 6785.4 7103.5 7142.4 7195.1 7199.2 7341.3 6906.8 6915.4 6921.1 6921.9 6926.1 3912.0 3957.4 3977.5 3986.6 3988.3 7598.7 7656.6 7664.8 7687.2 7689.2 7356.9 7451.7 7492.7 7513.3 7519.1 7602.5 7618.5 7627.8 7657.1 7678.3 7323.3 7329.8 7338.6 7342.4 7348.9 7165.1 7201.9 7208.1 7233.8 7254.6 7214.3 7522.4 7537.8 7544.6 7601.5 4839.9 4860.0 4875.3 4880.1 4884.6 7189.7 7246.3 7251.3 7268.5 7278.2 7023.5 7075.2 7087.5 7092.6 7106.1 6883.9 7011.7 7068.6 7082.1 7101.7 6960.7 6964.8 6965.9 6969.4 6970.6 7104.3 7125.8 7139.4 7158.2 7159.5 6858.7 6959.1 6986.1 6989.1 6994.4 04:53:56 INFO - PROCESS | 23617 | 04:53:56 INFO - PROCESS | 23617 | [#5] yui.html Cycles:180 Average:15359.24 Median:48646.39 stddev:17847.46 (36.7%) stddev-sans-first:17864.08 04:53:56 INFO - PROCESS | 23617 | Values: 809.3 841.0 915.9 921.2 928.8 15063.0 15207.8 15210.0 15254.8 15255.2 14360.4 15107.8 15339.8 15383.7 15385.8 751.9 884.7 891.8 899.9 917.8 890.8 892.0 892.4 895.7 899.8 947.3 949.1 951.4 956.1 956.8 945.1 945.5 947.1 948.8 949.6 699.1 699.3 700.0 700.4 703.4 14897.6 14915.7 14923.7 15039.7 15077.4 14809.9 14956.4 15046.8 15231.5 15363.5 11913.8 12007.9 12112.5 12325.3 12379.6 4078.4 4078.8 4171.6 4250.6 4254.3 56065.7 57150.0 57190.1 58680.4 59455.8 11251.9 11384.4 11408.7 11483.1 11565.1 17533.9 17763.5 17767.5 17806.2 20537.0 8860.8 9022.5 9052.8 9070.3 9084.8 5037.1 5120.7 5145.8 5197.7 5286.6 3654.6 3713.9 3724.3 3727.9 3732.4 631.5 644.4 646.9 652.9 655.2 727.2 734.5 739.4 741.7 756.6 9492.9 9535.1 9887.4 9896.5 9916.4 720.8 728.5 739.6 759.3 794.9 4366.6 4399.3 4541.2 4555.1 4613.2 61051.7 61170.4 64447.7 64455.7 64545.0 54890.5 57005.4 57150.4 58284.4 58551.4 50865.0 51476.0 51694.7 52020.5 52597.5 7693.7 8004.9 8373.1 8802.9 8927.6 38032.4 38343.6 38511.0 38734.0 39898.6 45371.3 47724.0 48330.5 48962.3 49237.0 11321.4 11462.4 11542.2 11600.9 11727.7 11812.9 12754.7 12809.6 13148.5 13368.4 12406.4 12474.6 12521.9 12532.6 12678.1 12400.3 12489.6 12656.4 12717.0 12763.3 12233.4 12441.8 12567.7 12620.7 12630.7 9956.2 9966.3 10089.7 10132.9 10297.1 10041.4 10046.1 10426.5 10430.2 10452.8 04:53:56 INFO - PROCESS | 23617 | -------- Summary: end -------- 04:53:56 INFO - PROCESS | 23617 | 04:53:56 INFO - TEST-INFO | 23617: exit 0 04:53:56 INFO - TEST-OK | dromaeo_css | took 1108938ms 04:53:56 INFO - TEST-START | kraken 04:53:56 INFO - operating with platform_type : linux_ 04:53:56 INFO - Initialising browser for kraken test... 04:53:56 INFO - TEST-INFO | started process 23854 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpB6FnFP/profile http://localhost:55879/getInfo.html) 04:54:00 INFO - PROCESS | 23854 | 04:54:00 INFO - PROCESS | 23854 | (process:23935): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:54:01 INFO - PROCESS | 23854 | __metrics Screen width/height:1600/1200 04:54:01 INFO - PROCESS | 23854 | colorDepth:24 04:54:01 INFO - PROCESS | 23854 | Browser inner width/height: 1024/697 04:54:01 INFO - PROCESS | 23854 | __metrics 04:54:01 ERROR - PROCESS | 23854 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 04:54:02 INFO - TEST-INFO | 23854: exit 0 04:54:02 INFO - Browser initialized. 04:54:02 INFO - Running cycle 1/1 for kraken test... 04:54:02 INFO - TEST-INFO | started process 23986 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpB6FnFP/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:54:04 INFO - PROCESS | 23986 | 04:54:04 INFO - PROCESS | 23986 | (process:24054): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:54:14 INFO - PROCESS | 23986 | RSS: Main: 151891968 04:54:14 INFO - PROCESS | 23986 | 04:54:16 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55879/tests/kraken/driver.html?testName=audio-beat-detection) 04:54:17 INFO - PROCESS | 23986 | RSS: Main: 157073408 04:54:17 INFO - PROCESS | 23986 | 04:54:20 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55879/tests/kraken/driver.html?testName=audio-dft) 04:54:20 INFO - PROCESS | 23986 | RSS: Main: 156966912 04:54:20 INFO - PROCESS | 23986 | 04:54:23 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55879/tests/kraken/driver.html?testName=audio-fft) 04:54:24 INFO - PROCESS | 23986 | RSS: Main: 157282304 04:54:24 INFO - PROCESS | 23986 | 04:54:26 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55879/tests/kraken/driver.html?testName=audio-oscillator) 04:54:27 INFO - PROCESS | 23986 | RSS: Main: 157270016 04:54:27 INFO - PROCESS | 23986 | 04:54:29 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55879/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:54:29 INFO - PROCESS | 23986 | RSS: Main: 157286400 04:54:29 INFO - PROCESS | 23986 | 04:54:33 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55879/tests/kraken/driver.html?testName=imaging-darkroom) 04:54:33 INFO - PROCESS | 23986 | RSS: Main: 157483008 04:54:33 INFO - PROCESS | 23986 | 04:54:36 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55879/tests/kraken/driver.html?testName=imaging-desaturate) 04:54:37 INFO - PROCESS | 23986 | RSS: Main: 157532160 04:54:37 INFO - PROCESS | 23986 | 04:54:40 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55879/tests/kraken/driver.html?testName=json-parse-financial) 04:54:41 INFO - PROCESS | 23986 | RSS: Main: 157995008 04:54:41 INFO - PROCESS | 23986 | 04:54:42 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55879/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:54:43 INFO - PROCESS | 23986 | RSS: Main: 157376512 04:54:43 INFO - PROCESS | 23986 | 04:54:44 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55879/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:54:45 INFO - PROCESS | 23986 | RSS: Main: 157319168 04:54:45 INFO - PROCESS | 23986 | 04:54:47 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55879/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:54:48 INFO - PROCESS | 23986 | RSS: Main: 157323264 04:54:48 INFO - PROCESS | 23986 | 04:54:50 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55879/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:54:51 INFO - PROCESS | 23986 | RSS: Main: 157683712 04:54:51 INFO - PROCESS | 23986 | 04:54:53 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55879/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:54:54 INFO - PROCESS | 23986 | RSS: Main: 157708288 04:54:54 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | Cycle 1(1): loaded http://localhost:55879/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55879/tests/kraken/driver.html?testName=ai-astar) 04:54:56 INFO - PROCESS | 23986 | RSS: Main: 159047680 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | __start_tp_report 04:54:56 INFO - PROCESS | 23986 | _x_x_mozilla_page_load 04:54:56 INFO - PROCESS | 23986 | _x_x_mozilla_page_load_details 04:54:56 INFO - PROCESS | 23986 | |i|pagename|runs| 04:54:56 INFO - PROCESS | 23986 | |0;ai-astar;109;113;104;118;111;111;100;110;110;111 04:54:56 INFO - PROCESS | 23986 | |1;audio-beat-detection;160;126;157;178;132;159;157;133;192;131 04:54:56 INFO - PROCESS | 23986 | |2;audio-dft;164;163;163;165;165;164;161;161;163;164 04:54:56 INFO - PROCESS | 23986 | |3;audio-fft;77;77;76;166;74;73;76;77;161;77 04:54:56 INFO - PROCESS | 23986 | |4;audio-oscillator;92;92;153;91;92;93;140;92;91;142 04:54:56 INFO - PROCESS | 23986 | |5;imaging-gaussian-blur;117;117;117;119;117;117;118;120;118;118 04:54:56 INFO - PROCESS | 23986 | |6;imaging-darkroom;147;147;148;147;148;146;147;147;147;146 04:54:56 INFO - PROCESS | 23986 | |7;imaging-desaturate;97;95;104;95;95;95;95;96;95;95 04:54:56 INFO - PROCESS | 23986 | |8;json-parse-financial;56;57;58;56;57;63;57;93;57;57 04:54:56 INFO - PROCESS | 23986 | |9;json-stringify-tinderbox;57;58;58;58;59;58;59;59;59;58 04:54:56 INFO - PROCESS | 23986 | |10;stanford-crypto-aes;80;72;74;73;75;74;75;73;73;73 04:54:56 INFO - PROCESS | 23986 | |11;stanford-crypto-ccm;118;117;115;113;119;130;123;124;132;138 04:54:56 INFO - PROCESS | 23986 | |12;stanford-crypto-pbkdf2;166;166;165;157;157;161;161;161;158;167 04:54:56 INFO - PROCESS | 23986 | |13;stanford-crypto-sha256-iterative;75;67;67;69;68;68;67;70;66;68 04:54:56 INFO - PROCESS | 23986 | __end_tp_report 04:54:56 INFO - PROCESS | 23986 | __start_cc_report 04:54:56 INFO - PROCESS | 23986 | _x_x_mozilla_cycle_collect,858 04:54:56 INFO - PROCESS | 23986 | __end_cc_report 04:54:56 INFO - PROCESS | 23986 | __startTimestamp1462535696587__endTimestamp 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | ------- Summary: start ------- 04:54:56 INFO - PROCESS | 23986 | Number of tests: 14 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#0] ai-astar Cycles:10 Average:109.70 Median:111.00 stddev:4.85 (4.4%) stddev-sans-first:5.14 04:54:56 INFO - PROCESS | 23986 | Values: 109.0 113.0 104.0 118.0 111.0 111.0 100.0 110.0 110.0 111.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#1] audio-beat-detection Cycles:10 Average:152.50 Median:158.00 stddev:21.89 (13.9%) stddev-sans-first:23.05 04:54:56 INFO - PROCESS | 23986 | Values: 160.0 126.0 157.0 178.0 132.0 159.0 157.0 133.0 192.0 131.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#2] audio-dft Cycles:10 Average:163.30 Median:164.00 stddev:1.42 (0.9%) stddev-sans-first:1.48 04:54:56 INFO - PROCESS | 23986 | Values: 164.0 163.0 163.0 165.0 165.0 164.0 161.0 161.0 163.0 164.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#3] audio-fft Cycles:10 Average:93.40 Median:76.50 stddev:36.99 (48.4%) stddev-sans-first:38.75 04:54:56 INFO - PROCESS | 23986 | Values: 77.0 77.0 76.0 166.0 74.0 73.0 76.0 77.0 161.0 77.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#4] audio-oscillator Cycles:10 Average:107.80 Median:92.00 stddev:25.89 (28.1%) stddev-sans-first:26.82 04:54:56 INFO - PROCESS | 23986 | Values: 92.0 92.0 153.0 91.0 92.0 93.0 140.0 92.0 91.0 142.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#5] imaging-gaussian-blur Cycles:10 Average:117.80 Median:118.00 stddev:1.03 (0.9%) stddev-sans-first:1.05 04:54:56 INFO - PROCESS | 23986 | Values: 117.0 117.0 117.0 119.0 117.0 117.0 118.0 120.0 118.0 118.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#6] imaging-darkroom Cycles:10 Average:147.00 Median:147.00 stddev:0.67 (0.5%) stddev-sans-first:0.71 04:54:56 INFO - PROCESS | 23986 | Values: 147.0 147.0 148.0 147.0 148.0 146.0 147.0 147.0 147.0 146.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#7] imaging-desaturate Cycles:10 Average:96.20 Median:95.00 stddev:2.82 (3.0%) stddev-sans-first:2.98 04:54:56 INFO - PROCESS | 23986 | Values: 97.0 95.0 104.0 95.0 95.0 95.0 95.0 96.0 95.0 95.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#8] json-parse-financial Cycles:10 Average:61.10 Median:57.00 stddev:11.39 (20.0%) stddev-sans-first:11.93 04:54:56 INFO - PROCESS | 23986 | Values: 56.0 57.0 58.0 56.0 57.0 63.0 57.0 93.0 57.0 57.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#9] json-stringify-tinderbox Cycles:10 Average:58.30 Median:58.50 stddev:0.67 (1.2%) stddev-sans-first:0.53 04:54:56 INFO - PROCESS | 23986 | Values: 57.0 58.0 58.0 58.0 59.0 58.0 59.0 59.0 59.0 58.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#10] stanford-crypto-aes Cycles:10 Average:74.20 Median:74.00 stddev:2.25 (3.0%) stddev-sans-first:1.01 04:54:56 INFO - PROCESS | 23986 | Values: 80.0 72.0 74.0 73.0 75.0 74.0 75.0 73.0 73.0 73.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#11] stanford-crypto-ccm Cycles:10 Average:122.90 Median:123.50 stddev:8.14 (6.6%) stddev-sans-first:8.44 04:54:56 INFO - PROCESS | 23986 | Values: 118.0 117.0 115.0 113.0 119.0 130.0 123.0 124.0 132.0 138.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:161.90 Median:163.00 stddev:3.87 (2.4%) stddev-sans-first:3.81 04:54:56 INFO - PROCESS | 23986 | Values: 166.0 166.0 165.0 157.0 157.0 161.0 161.0 161.0 158.0 167.0 04:54:56 INFO - PROCESS | 23986 | 04:54:56 INFO - PROCESS | 23986 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.50 Median:68.00 stddev:2.55 (3.7%) stddev-sans-first:1.20 04:54:56 INFO - PROCESS | 23986 | Values: 75.0 67.0 67.0 69.0 68.0 68.0 67.0 70.0 66.0 68.0 04:54:56 INFO - PROCESS | 23986 | -------- Summary: end -------- 04:54:56 INFO - PROCESS | 23986 | 04:54:57 INFO - TEST-INFO | 23986: exit 0 04:54:57 INFO - TEST-OK | kraken | took 60798ms 04:54:57 INFO - SUITE-END | took 1169s 04:54:57 INFO - Completed test suite (00:19:30) 04:54:57 INFO - javascript benchmark 04:54:57 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3351.832408379581, 3396.72826173906, 3410.7100896423804, 3450.8102054387014, 3452.9827350863256, 5676.120201368789, 5697.715114244282, 5710.657360558364, 5710.942890571098, 5737.856553586163, 5689.658620482774, 5716.742746576404, 5729.598928075036, 5742.885142297151, 5760.020796464601, 5173.482651734834, 5224.373075230958, 5273.736313184345, 5297.920531192035, 5322.787088516455, 5050.494950504957, 5144.511271429208, 5351.491608297206, 5378.650387724805, 5396.19057141428, 5190.429052804188, 5200.531952124308, 5244.39689435716, 5251.737413129347, 5282.709450980195, 5246.8688282792855, 5248.737563121847, 5302.0, 5305.3898801637915, 5327.147656374961, 4944.53026962438, 5069.569086627641, 5116.462771408986, 5170.327857378555, 5177.0, 5528.612997090206, 5543.805966791143, 5544.77820887164, 5562.110062390038, 5568.0, 6040.516758659297, 6049.062395328731, 6064.36324185963, 6075.544334174954, 6093.817185484442, 5909.113632955048, 5960.195373624549, 6049.727762250709, 6104.389561043905, 6128.050152226368, 5736.655800651933, 5740.56945729072, 5742.282214723118, 5747.885042299131, 5749.396313387076, 6242.250929888442, 6244.37556244381, 6245.156903818017, 6245.313015568284, 6251.562390632703, 5909.261342332208, 5985.461308482258, 5985.730642121115, 6010.459058684739, 6018.518518518508, 5959.910601340984, 5986.5809393342915, 5988.401159884064, 5991.760329586855, 5991.940080599138, 5815.069588865761, 5940.554458415636, 5949.583529153005, 5958.344582095966, 5982.102684597258, 6055.7274922628585, 6063.211782468339, 6065.120557519223, 6085.0, 6123.326434092246, 4605.055963527536, 4608.907821843544, 4609.147307748078, 4609.423822022247, 4639.582437580634, 4030.1133750574827, 4047.5142982841658, 4077.6941729370415, 4131.318332475168, 4139.965008747813, 5776.653400795882, 5778.191053252548, 5805.390434004453, 5843.561732870052, 5933.970330148321, 6052.425019623129, 6061.424164704346, 6092.603980741326, 6109.938900611026, 6109.961306577892, 5660.150977353348, 5766.94233057664, 5827.562932780059, 5839.357670656224, 5862.267216597926, 5223.503767142115, 5225.738713064332, 5227.686338819683, 5251.343582052244, 5254.474552544715, 6339.207599050119, 6339.587926784837, 6355.3009168991375, 6357.396047375492, 6359.9364006360265, 6005.429484199081, 6103.8779224414375, 6159.19930409044, 6169.84575385619, 6188.164597779242, 6251.124842521959, 6283.3716628338625, 6291.433770960635, 6291.716872740646, 6315.242170939517, 5906.940930590811, 5971.253593300838, 5980.491658209101, 5984.102384642339, 5999.220101386966, 6024.728887199999, 6055.031195008777, 6098.573099883143, 6099.0, 6127.111568822585, 5774.335951365647, 5833.533317334688, 5841.620294680833, 5843.211166492639, 5849.268841394825, 5752.9137062943255, 5783.219265399117, 5822.73797679097, 5827.76688932438, 5948.0, 5729.083346664514, 5730.025895597842, 5735.426457354231, 5744.971275143597, 5762.423757624204, 5785.4214578541805, 5844.211031510692, 5857.58996870215, 5877.382874798255, 5882.823515294548, 5735.852829434213, 5771.249737534094, 5782.913256301074, 5791.0, 5872.882542349214], "value": 5598.529249982468, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [614.4285814192799, 666.663335015817, 672.1900110367009, 674.5312008154332, 678.4775722693527, 33161.834190829046, 39838.004049898766, 40378.0, 40757.184856302854, 40757.592424075716, 41783.79108104463, 42023.0, 42419.0, 42631.14737705244, 42722.7863860681, 8660.220580147801, 8798.736037918841, 8841.823163536757, 8858.247049000842, 8886.777830554223, 8708.042115367305, 8796.0, 8808.20726134651, 8814.33892458065, 9047.773805654846, 9063.637454501812, 9081.409708368968, 9116.954415227949, 9121.635134594608, 9139.68011119611, 8998.100189980982, 9035.367524273304, 9047.7285681429, 9081.50051747157, 9093.13615206561, 9033.0, 9108.043655416219, 9141.360104792668, 9151.679691210775, 9167.174954254082, 43528.78235608801, 43706.78146609246, 43911.56088439107, 44016.55983440189, 44078.33882491765, 3723.1622884850963, 3877.6406693023464, 3902.5902280260448, 3954.5649978502342, 4189.556353251496, 33220.667793322, 33290.0, 33479.832600837086, 33666.663333366596, 35193.47209791855, 4507.481639611454, 4514.5936865681915, 4535.297028960516, 4571.994161284545, 4625.653076019312, 222417.0, 222648.0, 222661.0, 222953.0, 224676.0, 55503.44496555063, 61221.69389153115, 61419.23613437406, 61448.69275653593, 61495.69252153711, 73852.63073684704, 74953.62523187349, 75500.0, 75867.0, 75892.62053689697, 18015.63968720618, 18032.549186270186, 18051.27794888216, 18140.183691733902, 18314.725279120823, 14596.489122880648, 14643.0, 14735.852641473663, 14765.187914664582, 14791.038582492103, 20444.773313601232, 20745.0, 20821.583568328548, 20909.58180836405, 20924.16303347849, 7747.38020958322, 7756.767296980986, 7792.2986931176465, 7858.803529911798, 7882.0, 1138.7210133517176, 1166.4809159923923, 1199.0707201918583, 1210.922279171538, 1224.5836415618733, 33175.004749857544, 33515.66484335174, 33611.495827562605, 33720.0, 34217.65782342145, 1282.2178471132602, 1295.2875918245115, 1305.3081866610712, 1309.7838856588746, 1321.1940716163133, 16814.0, 17524.247575242374, 17574.736378954327, 17657.0, 17775.288988440316, 459436.0, 505331.42002869985, 510838.0, 512451.0, 523732.0, 56778.0, 57572.0, 57607.0, 57980.71009644925, 58196.709016454646, 1540.8767298616083, 1541.2910061371895, 1543.930523126462, 1545.5131633535625, 1643.005981381271, 32850.34299314048, 33036.834815825765, 33715.325693486484, 33975.830120849234, 34083.65916340805, 52722.0, 53350.0, 53388.73305633447, 53401.0, 53532.73233633807, 419295.0, 419421.0, 420953.0, 421442.0, 422212.0, 30668.846655766578, 30866.0, 31448.056558303288, 31565.526517101804, 31643.0, 49451.752741237506, 50646.0, 51578.0, 51585.22622160595, 52965.0, 37705.43441848319, 38262.42606360962, 38699.41950870796, 38724.0, 38732.6126738729, 37354.8132259337, 37674.81162594169, 38539.42190867195, 38826.0, 39104.608953911236, 39550.80224598858, 39737.60262397339, 39948.80025599853, 40291.39562906617, 40295.1940961185, 34333.656663433045, 36104.35650979903, 36964.81517592395, 37114.628853712195, 37450.625493744716, 28839.279018024718, 28871.56692649654, 29054.994432957366, 29415.55876661809, 29604.259893501974], "value": 20679.25682333808, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [419.58880297308644, 428.06895003367686, 428.96997210195286, 434.4048653344918, 437.0646815814158, 18529.722054169182, 19175.0, 19208.807911920892, 19379.0, 20025.399238022845, 19598.31405900794, 19827.0, 20254.797452025476, 20323.288684896033, 20444.59110817783, 5274.81538146164, 5316.813911513098, 5425.6202065855405, 5450.209719590657, 5516.393196748354, 5389.029974604569, 5436.972815135919, 5447.1829225616075, 5472.20653005314, 5508.20131080993, 5477.123660214346, 5480.698561579112, 5482.91775623366, 5504.862378440531, 5777.508911742486, 5666.093425051992, 5673.517750991171, 5698.629589076718, 5702.942970570282, 5742.7415766290615, 5523.972380138073, 5786.392428795, 5791.507721843648, 5798.855028624276, 5813.186153938452, 13517.864821351759, 13585.660358491017, 13839.30803459833, 14508.927455362762, 14540.491082812157, 2576.4541275234897, 2627.881745321465, 2728.154272175632, 3155.826429546374, 3164.6360668522952, 9848.310618256653, 10410.635627752992, 10545.84181237282, 10551.15590752738, 10639.946800265949, 2040.877547347164, 2047.7133201351824, 2057.989710051455, 2086.499240182345, 2151.7202763640626, 81953.59023204906, 84713.15286847176, 87907.0, 88248.0, 88424.0, 11409.48657310423, 11519.0, 12091.0, 12280.631581052583, 12421.19262247951, 16367.099809510592, 16455.506334809976, 16501.58746031359, 16531.090790006423, 16534.255958481896, 8831.425957312882, 8984.55077246135, 9045.954770226106, 9247.630094796268, 9256.074392560824, 8901.599428025755, 8918.152775486318, 9002.86495702565, 9133.771655708528, 9174.724758257264, 4896.779644915988, 5077.822276220315, 5079.339685840817, 5085.601459598566, 5123.487651234921, 2036.9019909493245, 2086.874787512754, 2097.538541520863, 2124.8193903518063, 2141.864811649828, 487.39319547164007, 1041.3283432186197, 1145.2098052343856, 1154.2901115813713, 1167.9065674746, 10694.839577406345, 12318.137730358789, 12377.814332785016, 12422.440990155465, 12436.81344779829, 502.3921055522785, 506.72890003847766, 507.8222622082242, 514.1311184098861, 533.280071902928, 6574.835629109215, 6711.463082953352, 6796.422304104207, 6831.0, 6847.452203823682, 521560.0, 522989.0, 524979.0, 535078.0, 541517.0, 87803.0, 91652.08347916436, 91904.0, 91966.54016730007, 94518.58222126674, 505.00261982584834, 509.1192237429194, 512.684698910175, 512.7231295100678, 513.933188685476, 11094.556217751522, 11310.151738619472, 11453.0, 11499.080073593925, 11559.653210403701, 36667.0, 38585.2282954345, 38953.610463895, 39285.80357098196, 39406.0, 56123.719381404466, 58317.4168258312, 58831.0, 59129.40870591239, 59177.0, 8696.21734043939, 9257.722268331692, 9277.396969196981, 9389.061093890556, 9498.667546635834, 13080.607581772561, 13221.933890330487, 14238.644033898821, 14256.0, 14697.779533307223, 12357.25856448616, 12557.497700091893, 12628.179168354027, 13087.869121309046, 13120.081594288307, 6601.9009714853355, 10307.0, 12179.208351457128, 12543.817718291863, 12614.117011809085, 12908.935455323039, 13052.608421747364, 13166.341682915625, 13366.0, 13659.248741318925, 8906.198442140238, 9395.812083758423, 9467.0, 9514.762130946781, 9821.361611495517, 12148.149629526202, 12190.756184876076, 12191.390430478617, 12253.816192756938, 12314.261144331369], "value": 8747.868815584086, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1579.4156162219979, 1609.1632351177389, 1793.8833975791572, 1879.6334714730633, 1913.6651086059944, 7689.346405555534, 8380.45527040742, 8432.620532076056, 8634.222919937212, 8645.0, 7473.4394920381055, 8111.986001749781, 8142.145074767153, 8206.589670516465, 8345.374096942724, 2369.478714682767, 2373.643953406994, 2391.3977634984603, 2397.7961873240797, 2398.0527691561824, 2376.9049238030457, 2397.3167647220544, 2413.9981907508363, 2440.2069327468553, 2440.9511809763794, 2385.403649087728, 2404.627282771173, 2428.538577670246, 2462.987685061581, 2465.4206261528525, 2415.6014257647553, 2428.562858685436, 2428.8785560721894, 2441.3164313991933, 2453.987730061347, 2411.3127758588894, 2421.9273421797197, 2423.575874222022, 2423.903043878243, 2425.927222183337, 8617.827643447159, 8659.48043117415, 8661.870071948926, 8703.608337624823, 8729.956350218272, 5360.839174824722, 5424.972875135599, 5454.890902181974, 5470.206820011116, 5486.533644640211, 3315.0, 3368.1579605098727, 3374.240795820945, 3398.507216453625, 3398.8130652814084, 1065.1478816946412, 1082.884628832304, 1089.215764649451, 1111.2388014210292, 1127.0532752487868, 12303.630891073282, 12319.260844349368, 12330.938345308306, 12331.0, 12331.383430828513, 4535.7732113394195, 4593.379893714306, 4645.419322584677, 4705.95294047062, 4747.786349614275, 10415.0, 10431.94784026075, 10438.68683939483, 10477.68566942993, 10501.107405870434, 5422.945770542323, 5468.562514998791, 5471.042567550663, 5479.53423958968, 5485.807996720096, 4463.375127482155, 4877.68295060827, 4934.703917764946, 4953.281774142729, 4994.500549944976, 4039.6768258539246, 4083.9183216335505, 4108.876733697994, 4134.441850350225, 4153.293940030202, 1322.7619028574757, 1339.3571085878832, 1355.4578168732585, 1364.1761553584183, 1365.0649305225952, 926.9304802139867, 1014.6651604970342, 1032.4528000159928, 1040.8959104089531, 1041.401194313273, 5730.111832665943, 5791.739371728282, 5797.507211886952, 5902.144189092557, 5910.408959104141, 437.71111066696466, 445.125328729049, 445.70360710127403, 446.34164607204116, 447.7089891570505, 3878.2852003597595, 3909.3940439231965, 3911.4523966644692, 3955.1891862168186, 4014.297497937849, 10459.529321180566, 10877.564897404016, 10942.726431839268, 10984.835227471594, 11052.447377631248, 10329.12202462784, 10752.462376881125, 10836.295640783324, 10867.076298514557, 10883.074938630147, 8124.7562573122905, 8125.512469251746, 8239.764035394739, 8251.0, 8314.334853211849, 5726.141078838207, 5813.09896965971, 5845.707714614167, 5853.531717462678, 5881.2734658248855, 9484.288678349014, 9533.952330238304, 9561.378510396802, 9709.465979371202, 9748.463834488888, 9593.664221752206, 9697.6120955161, 9791.0, 9793.412395256308, 10089.646862359783, 6567.9014814776865, 7265.527740696838, 7361.8159546011775, 7593.430492712958, 7600.543967361976, 8149.0, 8189.058258300372, 8200.712975045844, 8214.096449390443, 8232.958835205785, 7322.780316590511, 7540.396768258636, 7576.7348142814735, 7618.580978046039, 7622.199669034671, 7330.816729581803, 7395.482316237812, 7433.145188303198, 7484.401247900264, 7507.136679281734, 7008.369246767816, 7033.9296607033275, 7073.752418665322, 7076.0801095857205, 7103.50275480732, 5013.373328333958, 5020.824271150492, 5157.510036546522, 5163.741812909415, 5170.0, 4916.7541622919425, 5036.093503169464, 5041.924371134362, 5091.414487334004, 5231.712255825966], "value": 4551.148827808746, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [356.4403885899136, 357.171362439141, 359.13627725320595, 361.13688284998847, 363.5219686112762, 6662.600243985365, 6670.966645166774, 6680.933190668092, 6695.598264104157, 6725.798226053214, 6628.502862285324, 6630.03864439656, 6638.50211234157, 6640.435562977141, 6656.2012558492925, 4779.1397548441355, 4868.342773725555, 5023.146065168912, 5034.270030845525, 5055.811884207208, 5005.324281222025, 5035.446100928895, 5042.571381432583, 5046.646734728571, 5056.949430505703, 4965.031818795336, 4973.925391119136, 4989.950100499003, 5000.0999820032375, 5007.924881126786, 4994.77523511441, 5011.223260394645, 5011.799528018875, 5019.272205530177, 5023.799048038074, 4401.955980440187, 4407.955920440787, 4411.558844115595, 4412.514623391425, 4417.845375411877, 6168.414000669929, 6366.172397588284, 6405.423511883906, 6430.7106180222, 6432.678366081724, 5721.0, 5734.827955161351, 5760.884782304331, 5772.624779389326, 5775.162601422812, 6984.546004509691, 6992.54548454354, 7000.5099643025005, 7006.264342244042, 7010.439164866799, 4719.740414277213, 4731.976340118312, 4732.810687572493, 4733.455652599961, 4736.763161841928, 7207.675654595609, 7296.525725827804, 7300.671469783872, 7344.669489872915, 7364.815879602999, 4839.588634966068, 4847.636427267969, 4852.927206091911, 4862.586680132228, 4868.172410690191, 4886.755662216946, 4898.2652602109965, 4915.631327650441, 4919.1391506486225, 4922.458529561745, 5710.0, 5712.343080545707, 5713.514351280188, 5714.142878568248, 5725.570582206351, 6952.652367381611, 7011.754588589375, 7023.262557431396, 7031.542949708252, 7035.859282814315, 1720.5354554270277, 1729.0317422243331, 1737.2095696458082, 1742.5904912345588, 1745.7555942168106, 1073.6188653028219, 1115.520326259716, 1126.1666366888444, 1132.7281452451352, 1134.444122380028, 6659.433948114368, 6745.898811517831, 6763.5265531413315, 6785.1518560179975, 6785.355391237825, 7103.467239957024, 7142.392896603743, 7195.100612423447, 7199.2080871104135, 7341.3392794648735, 6906.827329316808, 6915.377616014483, 6921.134858142732, 6921.93078069223, 6926.134233220848, 3911.9804400977814, 3957.406389041667, 3977.463042489285, 3986.621270979252, 3988.2821092203103, 7598.696052157962, 7656.61716914152, 7664.770056898302, 7687.192844751333, 7689.19263477338, 7356.926430735732, 7451.739189128354, 7492.737754178577, 7513.2862378074, 7519.135299440525, 7602.543847369176, 7618.504797188165, 7627.771166865003, 7657.119431265364, 7678.308952194217, 7323.304286092813, 7329.816754581178, 7338.559686418832, 7342.449316301192, 7348.926510735038, 7165.140183178052, 7201.855962880818, 7208.098987626547, 7233.782986510413, 7254.5647261164495, 7214.278572142954, 7522.398208143226, 7537.849243014999, 7544.585047822203, 7601.505902116566, 4839.903201935871, 4860.0, 4875.3174555562955, 4880.072786170616, 4884.63365247615, 7189.7483588074165, 7246.311600397954, 7251.274872512707, 7268.454865884974, 7278.235785242685, 7023.508354415142, 7075.186353569406, 7087.50387472872, 7092.645367731696, 7106.076210092655, 6883.8967415487805, 7011.719531218898, 7068.6112263823925, 7082.114735658043, 7101.715931362688, 6960.651967401711, 6964.756233532004, 6965.860682786215, 6969.442444604318, 6970.581765094111, 7104.289571042855, 7125.786226413215, 7139.357457828821, 7158.248383919614, 7159.498835081495, 6858.6570671467225, 6959.130108736408, 6986.091808065123, 6989.0564773754895, 6994.370506654425], "value": 5276.071775065286, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [809.3363441977581, 840.9621567029479, 915.9129882661146, 921.2353746390496, 928.8049509602984, 15063.0, 15207.771883421758, 15210.0, 15254.847451525482, 15255.160966146857, 14360.353784079716, 15107.77338339923, 15339.769903451457, 15383.69232615347, 15385.846141538581, 751.9248075192492, 884.7257350221436, 891.7859713668705, 899.9370044096916, 917.7889085510336, 890.844102282098, 892.0499667853747, 892.3887137310962, 895.6686026170327, 899.7795540092653, 947.3415975896754, 949.1220620925651, 951.4101257220533, 956.1060408518023, 956.7608097975506, 945.0643862576035, 945.4516380499294, 947.1286416496771, 948.8481842905137, 949.586929685589, 699.105145413871, 699.3111784891928, 700.0304578159236, 700.422151724824, 703.3669697272445, 14897.627559310995, 14915.701685966329, 14923.701525969529, 15039.699206015928, 15077.396904123822, 14809.925950370287, 14956.40174393023, 15046.774298385424, 15231.543053708407, 15363.539093827203, 11913.761724765543, 12007.879921200763, 12112.454939527743, 12325.260484370967, 12379.566715164927, 4078.4290199372113, 4078.775667338295, 4171.561985991488, 4250.617444430016, 4254.340577210537, 56065.719671401384, 57150.0, 57190.14214786782, 58680.41319586835, 59455.81088378251, 11251.943740281245, 11384.373859437645, 11408.657740267805, 11483.13876459269, 11565.074794016627, 17533.912330438267, 17763.46709598688, 17767.46697599074, 17806.198721057583, 20537.0, 8860.778480537909, 9022.503762293005, 9052.773680657905, 9070.319726020574, 9084.772880678036, 5037.11850426174, 5120.667156634807, 5145.845624631267, 5197.7401129943355, 5286.550643195372, 3654.5979942206336, 3713.8885833425043, 3724.273766615538, 3727.9440808387894, 3732.4401339798706, 631.4537924695197, 644.3524258120559, 646.8641585267053, 652.9020646903002, 655.2235600812957, 727.1782885339638, 734.474850481908, 739.3863093632273, 741.6551303643831, 756.5687558091835, 9492.857607135898, 9535.114731300315, 9887.357321774061, 9896.505174741234, 9916.405015699082, 720.7549433192635, 728.4864170759602, 739.5710487916995, 759.3128218961848, 794.9244821741926, 4366.563343665608, 4399.252127138394, 4541.182587134282, 4555.088982203572, 4613.2388155953895, 61051.69474152601, 61170.38829611647, 64447.67776161089, 64455.67772161203, 64545.0, 54890.45109548853, 57005.42994570084, 57150.428495714514, 58284.41715582875, 58551.4144858546, 50865.0, 51476.0, 51694.67373968105, 52020.47979520232, 52597.474025260024, 7693.730719424793, 8004.919950800418, 8373.120822313813, 8802.86795698078, 8927.642894284156, 38032.42951355787, 38343.61656383512, 38511.0, 38734.0, 39898.60101399065, 45371.319430207914, 47724.0, 48330.516694834005, 48962.26556601725, 49237.0, 11321.377324247245, 11462.369569673414, 11542.19204655666, 11600.941995290306, 11727.706807329885, 11812.881871181178, 12754.68113297175, 12809.551665692028, 13148.474061037834, 13368.398422071225, 12406.379681015733, 12474.625761227178, 12521.87478125207, 12532.624021279376, 12678.112532122663, 12400.31798251105, 12489.562865300035, 12656.430460629477, 12717.0, 12763.298018609066, 12233.388330583613, 12441.813372799596, 12567.748645026866, 12620.684482887635, 12630.684232894251, 9956.153726933291, 9966.252531060345, 10089.747756306151, 10132.898671013196, 10297.124744396511, 10041.447720375449, 10046.146077583195, 10426.530806113591, 10430.165586753194, 10452.843207351743], "value": 7040.746538745174, "unit": "score"}], "name": "dromaeo_css", "value": 7451.892644067672, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 113.0, 104.0, 118.0, 111.0, 111.0, 100.0, 110.0, 110.0, 111.0], "value": 109.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 126.0, 157.0, 178.0, 132.0, 159.0, 157.0, 133.0, 192.0, 131.0], "value": 152.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 163.0, 163.0, 165.0, 165.0, 164.0, 161.0, 161.0, 163.0, 164.0], "value": 163.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 77.0, 76.0, 166.0, 74.0, 73.0, 76.0, 77.0, 161.0, 77.0], "value": 93.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 92.0, 153.0, 91.0, 92.0, 93.0, 140.0, 92.0, 91.0, 142.0], "value": 107.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 119.0, 117.0, 117.0, 118.0, 120.0, 118.0, 118.0], "value": 117.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 148.0, 147.0, 148.0, 146.0, 147.0, 147.0, 147.0, 146.0], "value": 147.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 95.0, 104.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0], "value": 96.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 57.0, 58.0, 56.0, 57.0, 63.0, 57.0, 93.0, 57.0, 57.0], "value": 61.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 58.0, 58.0, 58.0, 59.0, 58.0, 59.0, 59.0, 59.0, 58.0], "value": 58.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 72.0, 74.0, 73.0, 75.0, 74.0, 75.0, 73.0, 73.0, 73.0], "value": 74.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 115.0, 113.0, 119.0, 130.0, 123.0, 124.0, 132.0, 138.0], "value": 122.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 166.0, 165.0, 157.0, 157.0, 161.0, 161.0, 161.0, 158.0, 167.0], "value": 161.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 67.0, 67.0, 69.0, 68.0, 68.0, 67.0, 70.0, 66.0, 68.0], "value": 68.5, "unit": "score"}], "name": "kraken", "value": 1534.6000000000001, "alertThreshold": 2.0}]} 04:54:57 INFO - Return code: 0 04:54:57 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 04:54:57 ERROR - # TBPL SUCCESS # 04:54:57 INFO - Running post-action listener: _resource_record_post_action 04:54:57 INFO - Running post-run listener: _resource_record_post_run 04:54:58 INFO - Total resource usage - Wall time: 1187s; CPU: 13.0%; Read bytes: 8192; Write bytes: 368033792; Read time: 164; Write time: 198944 04:54:58 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 118333440; Read time: 0; Write time: 76828 04:54:58 INFO - run-tests - Wall time: 1171s; CPU: 13.0%; Read bytes: 8192; Write bytes: 249700352; Read time: 164; Write time: 122116 04:54:58 INFO - Running post-run listener: _upload_blobber_files 04:54:58 INFO - Blob upload gear active. 04:54:58 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:54:58 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 04:54:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:54:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:54:59 INFO - (blobuploader) - INFO - Open directory for files ... 04:54:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 04:54:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:54:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:55:00 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 04:55:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:55:00 INFO - (blobuploader) - INFO - Done attempting. 04:55:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 04:55:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:55:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:55:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 04:55:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:55:01 INFO - (blobuploader) - INFO - Done attempting. 04:55:01 INFO - (blobuploader) - INFO - Iteration through files over. 04:55:01 INFO - Return code: 0 04:55:01 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:55:01 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:55:01 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b004e064ec0b202dc70ec1f386a572879bbeb3294581ec9ad590cc8c6cc5cc2e4443cd802468cc660d24eb00963d660b8cf8dd765b9074aa2ebc738ec9895ade", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ea589d8d2a6de8bcdb619834e1a09918228b09672acf459cc19038ad694618e5671d455b55e8fa7e58f2a984cd119e353bbba82a1f9ce511c3feda6fa281b5c4"} 04:55:01 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:55:01 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:55:01 INFO - Contents: 04:55:01 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b004e064ec0b202dc70ec1f386a572879bbeb3294581ec9ad590cc8c6cc5cc2e4443cd802468cc660d24eb00963d660b8cf8dd765b9074aa2ebc738ec9895ade", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ea589d8d2a6de8bcdb619834e1a09918228b09672acf459cc19038ad694618e5671d455b55e8fa7e58f2a984cd119e353bbba82a1f9ce511c3feda6fa281b5c4"} 04:55:01 INFO - Running post-run listener: copy_logs_to_upload_dir 04:55:01 INFO - Copying logs to upload dir... 04:55:01 INFO - mkdir: /builds/slave/test/build/upload/logs 04:55:01 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1229.213372 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 29 secs) (at 2016-05-06 04:55:00.386366) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-06 04:55:00.390135) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/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/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178 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/Mozilla-Aurora/sha512/b004e064ec0b202dc70ec1f386a572879bbeb3294581ec9ad590cc8c6cc5cc2e4443cd802468cc660d24eb00963d660b8cf8dd765b9074aa2ebc738ec9895ade", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ea589d8d2a6de8bcdb619834e1a09918228b09672acf459cc19038ad694618e5671d455b55e8fa7e58f2a984cd119e353bbba82a1f9ce511c3feda6fa281b5c4"} build_url:https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011447 build_url: 'https://queue.taskcluster.net/v1/task/CZULdrJzSvuOvylse2l50g/artifacts/public/build/firefox-48.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/b004e064ec0b202dc70ec1f386a572879bbeb3294581ec9ad590cc8c6cc5cc2e4443cd802468cc660d24eb00963d660b8cf8dd765b9074aa2ebc738ec9895ade", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ea589d8d2a6de8bcdb619834e1a09918228b09672acf459cc19038ad694618e5671d455b55e8fa7e58f2a984cd119e353bbba82a1f9ce511c3feda6fa281b5c4"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-06 04:55:00.417006) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 04:55:00.417454) ========= rm -f oauth.txt in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=0e2a256762fed810e2f0f810000001b3-1462534470.136492-890487178 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004456 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-06 04:55:00.500322) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-06 04:55:00.500647) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-06 04:55:00.500931) ========= ========= Total master_lag: 0.16 =========