builder: mozilla-central_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-044 starttime: 1451477189.24 results: success (0) buildid: 20151230025438 builduid: 701411db8ca34330899c19a3583e2c7a revision: 635705bebbd3913910336ebfa7b9b9a7dd82e906 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.237074) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.237689) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.237990) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006491 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.266276) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.266631) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.285453) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.285829) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004634 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.349393) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.349696) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.350061) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.350605) ========= 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=0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-12-30 04:06: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% 43.7M=0s 2015-12-30 04:06:30 (43.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.159541 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.539547) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.539866) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.013664 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.604337) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:29.604695) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 635705bebbd3913910336ebfa7b9b9a7dd82e906 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 635705bebbd3913910336ebfa7b9b9a7dd82e906 --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=0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-12-30 04:06:30,537 truncating revision to first 12 chars 2015-12-30 04:06:30,537 Setting DEBUG logging. 2015-12-30 04:06:30,537 attempt 1/10 2015-12-30 04:06:30,537 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/635705bebbd3?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-12-30 04:06:30,759 unpacking tar archive at: mozilla-central-635705bebbd3/testing/mozharness/ program finished with exit code 0 elapsedTime=0.532694 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:30.152604) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:30.153194) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:30.163668) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:30.164259) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-30 04:06:30.165426) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 30 secs) (at 2015-12-30 04:06:30.165885) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 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', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] 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=0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:06:31 INFO - MultiFileLogger online at 20151230 04:06:31 in /builds/slave/test 04:06:31 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 04:06:31 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:06:31 INFO - {'append_to_log': False, 04:06:31 INFO - 'base_work_dir': '/builds/slave/test', 04:06:31 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 04:06:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:06:31 INFO - 'branch': 'Firefox-Non-PGO', 04:06:31 INFO - 'buildbot_json_path': 'buildprops.json', 04:06:31 INFO - 'config_files': ('talos/linux_config.py',), 04:06:31 INFO - 'default_actions': ('clobber', 04:06:31 INFO - 'read-buildbot-config', 04:06:31 INFO - 'download-and-extract', 04:06:31 INFO - 'populate-webroot', 04:06:31 INFO - 'create-virtualenv', 04:06:31 INFO - 'install', 04:06:31 INFO - 'run-tests'), 04:06:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:06:31 INFO - 'download_minidump_stackwalk': True, 04:06:31 INFO - 'download_symbols': 'ondemand', 04:06:31 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:06:31 INFO - 'tooltool.py': '/tools/tooltool.py', 04:06:31 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:06:31 INFO - '/tools/misc-python/virtualenv.py')}, 04:06:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:06:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:06:31 INFO - 'installer_path': 'installer.exe', 04:06:31 INFO - 'log_level': 'info', 04:06:31 INFO - 'log_name': 'talos', 04:06:31 INFO - 'log_to_console': True, 04:06:31 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:06:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:06:31 INFO - 'opt_config_files': (), 04:06:31 INFO - 'pip_index': False, 04:06:31 INFO - 'sps_profile': False, 04:06:31 INFO - 'sps_profile_interval': 0, 04:06:31 INFO - 'suite': 'dromaeojs', 04:06:31 INFO - 'system_bits': '32', 04:06:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:06:31 INFO - 'title': 'talos-linux64-ix-044', 04:06:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:06:31 INFO - 'use_talos_json': True, 04:06:31 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:06:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:06:31 INFO - 'work_dir': 'build'} 04:06:31 INFO - ##### 04:06:31 INFO - ##### Running clobber step. 04:06:31 INFO - ##### 04:06:31 INFO - Running pre-action listener: _resource_record_pre_action 04:06:31 INFO - Running main action method: clobber 04:06:31 INFO - rmtree: /builds/slave/test/build 04:06:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:06:31 INFO - Running post-action listener: _resource_record_post_action 04:06:31 INFO - ##### 04:06:31 INFO - ##### Running read-buildbot-config step. 04:06:31 INFO - ##### 04:06:31 INFO - Running pre-action listener: _resource_record_pre_action 04:06:31 INFO - Running main action method: read_buildbot_config 04:06:31 INFO - Using buildbot properties: 04:06:31 INFO - { 04:06:31 INFO - "project": "", 04:06:31 INFO - "product": "firefox", 04:06:31 INFO - "script_repo_revision": "production", 04:06:31 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 04:06:31 INFO - "repository": "", 04:06:31 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs", 04:06:31 INFO - "buildid": "20151230025438", 04:06:31 INFO - "pgo_build": "False", 04:06:31 INFO - "basedir": "/builds/slave/test", 04:06:31 INFO - "buildnumber": 356, 04:06:31 INFO - "slavename": "talos-linux64-ix-044", 04:06:31 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 04:06:31 INFO - "platform": "ubuntu64_hw", 04:06:31 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 04:06:31 INFO - "branch": "mozilla-central", 04:06:31 INFO - "repo_path": "mozilla-central", 04:06:31 INFO - "revision": "635705bebbd3913910336ebfa7b9b9a7dd82e906", 04:06:31 INFO - "stage_platform": "linux64", 04:06:31 INFO - "builduid": "701411db8ca34330899c19a3583e2c7a", 04:06:31 INFO - "slavebuilddir": "test" 04:06:31 INFO - } 04:06:31 INFO - Found installer url https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 04:06:31 INFO - Running post-action listener: _resource_record_post_action 04:06:31 INFO - ##### 04:06:31 INFO - ##### Running download-and-extract step. 04:06:31 INFO - ##### 04:06:31 INFO - Running pre-action listener: _resource_record_pre_action 04:06:31 INFO - Running main action method: download_and_extract 04:06:31 INFO - mkdir: /builds/slave/test/build/tests 04:06:31 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:06:31 INFO - https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 04:06:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/test_packages.json 04:06:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/test_packages.json 04:06:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 04:06:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 04:06:39 INFO - Downloaded 1302 bytes. 04:06:39 INFO - Reading from file /builds/slave/test/build/test_packages.json 04:06:39 INFO - Using the following test package requirements: 04:06:39 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 04:06:39 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:06:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 04:06:39 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:06:39 INFO - u'jsshell-linux-x86_64.zip'], 04:06:39 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:06:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 04:06:39 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 04:06:39 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:06:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 04:06:39 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:06:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 04:06:39 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:06:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 04:06:39 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 04:06:39 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 04:06:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 04:06:39 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:06:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:06:39 INFO - https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:06:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:06:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:06:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:06:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:06:49 INFO - Downloaded 21945375 bytes. 04:06:49 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 04:06:49 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:06:49 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 04:06:50 INFO - Return code: 0 04:06:50 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 04:06:50 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:06:50 INFO - https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:06:50 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:06:50 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:06:50 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:06:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:06:54 INFO - Downloaded 21945375 bytes. 04:06:54 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 04:06:54 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 04:06:54 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 04:06:56 INFO - Return code: 0 04:06:56 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:06:56 INFO - https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 04:06:56 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 04:06:56 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 04:06:56 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 04:06:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 04:06:56 INFO - Downloaded 11132270 bytes. 04:06:56 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 04:06:56 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 04:06:56 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 04:06:57 INFO - Return code: 0 04:06: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:06:57 INFO - https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 04:06:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 04:06:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 04:06:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 04:06:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 04:06:58 INFO - Downloaded 53339457 bytes. 04:06:58 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 04:06:58 INFO - mkdir: /builds/slave/test/properties 04:06:58 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:06:58 INFO - Writing to file /builds/slave/test/properties/build_url 04:06:58 INFO - Contents: 04:06:58 INFO - build_url:https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 04:06:58 INFO - Running post-action listener: _resource_record_post_action 04:06:58 INFO - Running post-action listener: set_extra_try_arguments 04:06:58 INFO - ##### 04:06:58 INFO - ##### Running populate-webroot step. 04:06:58 INFO - ##### 04:06:58 INFO - Running pre-action listener: _resource_record_pre_action 04:06:58 INFO - Running main action method: populate_webroot 04:06:58 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:06:58 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:06:58 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:06:58 INFO - '--tppagecycles', 04:06:58 INFO - '7'], 04:06:58 INFO - 'tests': ['tsvgm']}}, 04:06:58 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 04:06:58 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 04:06:58 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:06:58 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 04:06:58 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 04:06:58 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 04:06:58 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:06:58 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:06:58 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:06:58 INFO - 'talos_options': ['--e10s'], 04:06:58 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:06:58 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:06:58 INFO - 'tests': ['damp', 'tps']}, 04:06:58 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:06:58 INFO - 'talos_options': ['--e10s'], 04:06:58 INFO - 'tests': ['damp', 'tps']}, 04:06:58 INFO - 'g3': {'tests': ['dromaeo_dom']}, 04:06:58 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:06:58 INFO - 'other': {'tests': ['a11yr', 04:06:58 INFO - 'ts_paint', 04:06:58 INFO - 'tpaint', 04:06:58 INFO - 'sessionrestore', 04:06:58 INFO - 'sessionrestore_no_auto_restore']}, 04:06:58 INFO - 'other-e10s': {'talos_options': ['--e10s'], 04:06:58 INFO - 'tests': ['a11yr', 04:06:58 INFO - 'ts_paint', 04:06:58 INFO - 'tpaint', 04:06:58 INFO - 'sessionrestore', 04:06:58 INFO - 'sessionrestore_no_auto_restore']}, 04:06:58 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 04:06:58 INFO - 'tests': ['a11yr', 04:06:58 INFO - 'ts_paint', 04:06:58 INFO - 'tpaint', 04:06:58 INFO - 'sessionrestore', 04:06:58 INFO - 'sessionrestore_no_auto_restore']}, 04:06:58 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 04:06:58 INFO - 'tests': ['a11yr', 04:06:58 INFO - 'ts_paint', 04:06:58 INFO - 'tpaint', 04:06:58 INFO - 'sessionrestore', 04:06:58 INFO - 'sessionrestore_no_auto_restore']}, 04:06:58 INFO - 'other_l64': {'tests': ['a11yr', 04:06:58 INFO - 'ts_paint', 04:06:58 INFO - 'tpaint', 04:06:58 INFO - 'sessionrestore', 04:06:58 INFO - 'sessionrestore_no_auto_restore']}, 04:06:58 INFO - 'other_nol64': {'tests': ['a11yr', 04:06:58 INFO - 'ts_paint', 04:06:58 INFO - 'tpaint', 04:06:58 INFO - 'sessionrestore', 04:06:58 INFO - 'sessionrestore_no_auto_restore']}, 04:06:58 INFO - 'svgr': {'tests': ['tsvgx', 04:06:58 INFO - 'tsvgr_opacity', 04:06:58 INFO - 'tart', 04:06:58 INFO - 'tscrollx', 04:06:58 INFO - 'cart']}, 04:06:58 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 04:06:58 INFO - 'tests': ['tsvgx', 04:06:58 INFO - 'tsvgr_opacity', 04:06:58 INFO - 'tart', 04:06:58 INFO - 'tscrollx', 04:06:58 INFO - 'cart']}, 04:06:58 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:06:58 INFO - 'tests': ['tp5o']}, 04:06:58 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:06:58 INFO - 'talos_options': ['--e10s'], 04:06:58 INFO - 'tests': ['tp5o']}, 04:06:58 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:06:58 INFO - 'talos_options': ['--xperf_path', 04:06:58 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:06:58 INFO - 'tests': ['tp5n']}, 04:06:58 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:06:58 INFO - 'talos_options': ['--e10s', 04:06:58 INFO - '--xperf_path', 04:06:58 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:06:58 INFO - 'tests': ['tp5n']}}, 04:06:58 INFO - 'talos.zip': {'path': '', 04:06:58 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:06:58 INFO - Running post-action listener: _resource_record_post_action 04:06:58 INFO - ##### 04:06:58 INFO - ##### Running create-virtualenv step. 04:06:58 INFO - ##### 04:06:58 INFO - Running pre-action listener: _resource_record_pre_action 04:06:58 INFO - Running main action method: create_virtualenv 04:06:58 INFO - Creating virtualenv /builds/slave/test/build/venv 04:06:58 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:06:58 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:06:58 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:06:58 INFO - Using real prefix '/usr' 04:06:58 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:06:59 INFO - Installing distribute.............................................................................................................................................................................................done. 04:07:01 INFO - Installing pip.................done. 04:07:01 INFO - Return code: 0 04:07:01 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:07:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:07:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:07:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f06c6394f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2576dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26093d0>, '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 0x2574ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2575360>, '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': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', '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:07:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 04:07:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 04:07:01 INFO - Using env: {'DISPLAY': ':0', 04:07:01 INFO - 'HOME': '/home/cltbld', 04:07:01 INFO - 'LANG': 'en_US.UTF-8', 04:07:01 INFO - 'LANGUAGE': 'en_US:en', 04:07:01 INFO - 'LOGNAME': 'cltbld', 04:07:01 INFO - 'MAIL': '/var/mail/cltbld', 04:07:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:01 INFO - 'MOZ_NO_REMOTE': '1', 04:07:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:07:01 INFO - 'NO_EM_RESTART': '1', 04:07:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:07:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:01 INFO - 'PWD': '/builds/slave/test', 04:07:01 INFO - 'SHELL': '/bin/bash', 04:07:01 INFO - 'SHLVL': '1', 04:07:01 INFO - 'TERM': 'linux', 04:07:01 INFO - 'TMOUT': '86400', 04:07:01 INFO - 'USER': 'cltbld', 04:07:01 INFO - 'XDG_SESSION_COOKIE': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', 04:07:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:01 INFO - '_': '/tools/buildbot/bin/python'} 04:07:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:01 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:07:01 INFO - Cleaning up... 04:07:01 INFO - Return code: 0 04:07:01 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 04:07:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:07:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:07:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f06c6394f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2576dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26093d0>, '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 0x2574ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2575360>, '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': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', '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:07:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 04:07:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 04:07:01 INFO - Using env: {'DISPLAY': ':0', 04:07:01 INFO - 'HOME': '/home/cltbld', 04:07:01 INFO - 'LANG': 'en_US.UTF-8', 04:07:01 INFO - 'LANGUAGE': 'en_US:en', 04:07:01 INFO - 'LOGNAME': 'cltbld', 04:07:01 INFO - 'MAIL': '/var/mail/cltbld', 04:07:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:01 INFO - 'MOZ_NO_REMOTE': '1', 04:07:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:07:01 INFO - 'NO_EM_RESTART': '1', 04:07:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:07:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:01 INFO - 'PWD': '/builds/slave/test', 04:07:01 INFO - 'SHELL': '/bin/bash', 04:07:01 INFO - 'SHLVL': '1', 04:07:01 INFO - 'TERM': 'linux', 04:07:01 INFO - 'TMOUT': '86400', 04:07:01 INFO - 'USER': 'cltbld', 04:07:01 INFO - 'XDG_SESSION_COOKIE': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', 04:07:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:01 INFO - '_': '/tools/buildbot/bin/python'} 04:07:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:02 INFO - Downloading/unpacking psutil>=0.7.1 04:07: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:07: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:07: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:07: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:07: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:07: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:07:03 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 04:07:03 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 04:07:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:07:03 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:07:03 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:07:03 INFO - Installing collected packages: psutil 04:07:03 INFO - Running setup.py install for psutil 04:07:03 INFO - building 'psutil._psutil_linux' extension 04:07:03 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:07:04 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:07:04 INFO - building 'psutil._psutil_posix' extension 04:07:04 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:07:04 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:07:04 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:07:04 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:07:04 INFO - Successfully installed psutil 04:07:04 INFO - Cleaning up... 04:07:04 INFO - Return code: 0 04:07:04 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 04:07: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:07:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07: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:07:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f06c6394f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2576dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26093d0>, '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 0x2574ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2575360>, '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': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', '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:07:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 04:07:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 04:07:04 INFO - Using env: {'DISPLAY': ':0', 04:07:04 INFO - 'HOME': '/home/cltbld', 04:07:04 INFO - 'LANG': 'en_US.UTF-8', 04:07:04 INFO - 'LANGUAGE': 'en_US:en', 04:07:04 INFO - 'LOGNAME': 'cltbld', 04:07:04 INFO - 'MAIL': '/var/mail/cltbld', 04:07:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:04 INFO - 'MOZ_NO_REMOTE': '1', 04:07:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:07:04 INFO - 'NO_EM_RESTART': '1', 04:07:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:07:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:04 INFO - 'PWD': '/builds/slave/test', 04:07:04 INFO - 'SHELL': '/bin/bash', 04:07:04 INFO - 'SHLVL': '1', 04:07:04 INFO - 'TERM': 'linux', 04:07:04 INFO - 'TMOUT': '86400', 04:07:04 INFO - 'USER': 'cltbld', 04:07:04 INFO - 'XDG_SESSION_COOKIE': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', 04:07:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:04 INFO - '_': '/tools/buildbot/bin/python'} 04:07:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:04 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 04:07:04 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:07:04 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:07:04 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:07:04 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:07:04 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:07:04 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:07:06 INFO - Downloading mozsystemmonitor-0.0.tar.gz 04:07:06 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 04:07:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:07:06 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:07:06 INFO - Installing collected packages: mozsystemmonitor 04:07:06 INFO - Running setup.py install for mozsystemmonitor 04:07:06 INFO - Successfully installed mozsystemmonitor 04:07:06 INFO - Cleaning up... 04:07:06 INFO - Return code: 0 04:07:06 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:07:06 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:07:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:06 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:07:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:06 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f06c6394f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2576dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26093d0>, '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 0x2574ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2575360>, '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': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', '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:07:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 04:07:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 04:07:06 INFO - Using env: {'DISPLAY': ':0', 04:07:06 INFO - 'HOME': '/home/cltbld', 04:07:06 INFO - 'LANG': 'en_US.UTF-8', 04:07:06 INFO - 'LANGUAGE': 'en_US:en', 04:07:06 INFO - 'LOGNAME': 'cltbld', 04:07:06 INFO - 'MAIL': '/var/mail/cltbld', 04:07:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:06 INFO - 'MOZ_NO_REMOTE': '1', 04:07:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:07:06 INFO - 'NO_EM_RESTART': '1', 04:07:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:07:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:06 INFO - 'PWD': '/builds/slave/test', 04:07:06 INFO - 'SHELL': '/bin/bash', 04:07:06 INFO - 'SHLVL': '1', 04:07:06 INFO - 'TERM': 'linux', 04:07:06 INFO - 'TMOUT': '86400', 04:07:06 INFO - 'USER': 'cltbld', 04:07:06 INFO - 'XDG_SESSION_COOKIE': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', 04:07:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:06 INFO - '_': '/tools/buildbot/bin/python'} 04:07:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:06 INFO - Downloading/unpacking blobuploader==1.2.4 04:07: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:07: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:07: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:07: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:07: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:07: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:07:08 INFO - Downloading blobuploader-1.2.4.tar.gz 04:07:08 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 04:07:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:07:08 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:07:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:07:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:07:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:07:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:07:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:07:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:07:08 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 04:07:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:07:09 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:07: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:07: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:07: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:07: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:07: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:07: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:07:09 INFO - Downloading docopt-0.6.1.tar.gz 04:07:09 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 04:07:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:07:09 INFO - Installing collected packages: blobuploader, requests, docopt 04:07:09 INFO - Running setup.py install for blobuploader 04:07:09 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:07:09 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:07:09 INFO - Running setup.py install for requests 04:07:09 INFO - Running setup.py install for docopt 04:07:09 INFO - Successfully installed blobuploader requests docopt 04:07:09 INFO - Cleaning up... 04:07:09 INFO - Return code: 0 04:07:09 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:07:09 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:07:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:09 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:07:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f06c6394f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2576dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26093d0>, '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 0x2574ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2575360>, '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': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', '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:07:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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:07:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --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:07:09 INFO - Using env: {'DISPLAY': ':0', 04:07:09 INFO - 'HOME': '/home/cltbld', 04:07:09 INFO - 'LANG': 'en_US.UTF-8', 04:07:09 INFO - 'LANGUAGE': 'en_US:en', 04:07:09 INFO - 'LOGNAME': 'cltbld', 04:07:09 INFO - 'MAIL': '/var/mail/cltbld', 04:07:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:09 INFO - 'MOZ_NO_REMOTE': '1', 04:07:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:07:09 INFO - 'NO_EM_RESTART': '1', 04:07:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:07:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:09 INFO - 'PWD': '/builds/slave/test', 04:07:09 INFO - 'SHELL': '/bin/bash', 04:07:09 INFO - 'SHLVL': '1', 04:07:09 INFO - 'TERM': 'linux', 04:07:09 INFO - 'TMOUT': '86400', 04:07:09 INFO - 'USER': 'cltbld', 04:07:09 INFO - 'XDG_SESSION_COOKIE': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', 04:07:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:09 INFO - '_': '/tools/buildbot/bin/python'} 04:07:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:07:10 INFO - Running setup.py (path:/tmp/pip-TIkSkv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:07:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:07:10 INFO - Running setup.py (path:/tmp/pip-RzjWhS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:07:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:07:10 INFO - Running setup.py (path:/tmp/pip-3WlcyD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:07:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:07:10 INFO - Running setup.py (path:/tmp/pip-7AC5wJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:07:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:07:10 INFO - Running setup.py (path:/tmp/pip-ZgPhjH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:07:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:07:10 INFO - Running setup.py (path:/tmp/pip-v2Lq6P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:07:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:07:10 INFO - Running setup.py (path:/tmp/pip-YwnJmY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:07:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:07:10 INFO - Running setup.py (path:/tmp/pip-TXkNJ_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:07:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:07:10 INFO - Running setup.py (path:/tmp/pip-jt_30q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:07:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:07:10 INFO - Running setup.py (path:/tmp/pip-aVI4OU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:07:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:07:10 INFO - Running setup.py (path:/tmp/pip-rJ5cV1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:07:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:07:10 INFO - Running setup.py (path:/tmp/pip-peNzUq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:07:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:07:11 INFO - Running setup.py (path:/tmp/pip-AA8Xjv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:07:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:07:11 INFO - Running setup.py (path:/tmp/pip-GjSnrO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:07:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:07:11 INFO - Running setup.py (path:/tmp/pip-qaxkFc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:07:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:07:11 INFO - Running setup.py (path:/tmp/pip-SL8ba5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:07:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:07:11 INFO - Running setup.py (path:/tmp/pip-mJnz0T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:07:11 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:07:11 INFO - Running setup.py install for manifestparser 04:07:11 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:07:11 INFO - Running setup.py install for mozcrash 04:07:11 INFO - Running setup.py install for mozdebug 04:07:11 INFO - Running setup.py install for mozdevice 04:07:11 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:07:11 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:07:11 INFO - Running setup.py install for mozfile 04:07:11 INFO - Running setup.py install for mozhttpd 04:07:11 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:07:11 INFO - Running setup.py install for mozinfo 04:07:12 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:07:12 INFO - Running setup.py install for mozInstall 04:07:12 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:07:12 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:07:12 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:07:12 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:07:12 INFO - Running setup.py install for mozleak 04:07:12 INFO - Running setup.py install for mozlog 04:07:12 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:07:12 INFO - Running setup.py install for moznetwork 04:07:12 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:07:12 INFO - Running setup.py install for mozprocess 04:07:12 INFO - Running setup.py install for mozprofile 04:07:12 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:07:12 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:07:12 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:07:12 INFO - Running setup.py install for mozrunner 04:07:12 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:07:12 INFO - Running setup.py install for mozscreenshot 04:07:12 INFO - Running setup.py install for moztest 04:07:13 INFO - Running setup.py install for mozversion 04:07:13 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:07:13 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:07:13 INFO - Cleaning up... 04:07:13 INFO - Return code: 0 04:07:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:07:13 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:07:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:13 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:07:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f06c6394f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2576dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26093d0>, '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 0x2574ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2575360>, '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': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', '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:07:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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:07:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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:07:13 INFO - Using env: {'DISPLAY': ':0', 04:07:13 INFO - 'HOME': '/home/cltbld', 04:07:13 INFO - 'LANG': 'en_US.UTF-8', 04:07:13 INFO - 'LANGUAGE': 'en_US:en', 04:07:13 INFO - 'LOGNAME': 'cltbld', 04:07:13 INFO - 'MAIL': '/var/mail/cltbld', 04:07:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:13 INFO - 'MOZ_NO_REMOTE': '1', 04:07:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:07:13 INFO - 'NO_EM_RESTART': '1', 04:07:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:07:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:13 INFO - 'PWD': '/builds/slave/test', 04:07:13 INFO - 'SHELL': '/bin/bash', 04:07:13 INFO - 'SHLVL': '1', 04:07:13 INFO - 'TERM': 'linux', 04:07:13 INFO - 'TMOUT': '86400', 04:07:13 INFO - 'USER': 'cltbld', 04:07:13 INFO - 'XDG_SESSION_COOKIE': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', 04:07:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:13 INFO - '_': '/tools/buildbot/bin/python'} 04:07:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:07:13 INFO - Running setup.py (path:/tmp/pip-xvjMTC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:07:13 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:07:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:07:13 INFO - Running setup.py (path:/tmp/pip-cO0IUN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:07:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 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:07:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:07:13 INFO - Running setup.py (path:/tmp/pip-_RHloW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:07:13 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:07:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:07:13 INFO - Running setup.py (path:/tmp/pip-cdeTcO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:07:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 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:07:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:07:13 INFO - Running setup.py (path:/tmp/pip-SZypRR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:07:13 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:07:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:07:13 INFO - Running setup.py (path:/tmp/pip-WvnapU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:07:13 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:07:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:07:13 INFO - Running setup.py (path:/tmp/pip-M7DwGP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:07:13 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:07:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:07:13 INFO - Running setup.py (path:/tmp/pip-Lfyzlc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:07:13 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:07:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:07:13 INFO - Running setup.py (path:/tmp/pip-QguXNg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:07:14 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:07:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:07:14 INFO - Running setup.py (path:/tmp/pip-vEOxge-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:07:14 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:07:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:07:14 INFO - Running setup.py (path:/tmp/pip-XbGcoo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:07:14 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:07:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:07:14 INFO - Running setup.py (path:/tmp/pip-qYe2j9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:07:14 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:07:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:07:14 INFO - Running setup.py (path:/tmp/pip-_pZvdt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:07:14 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:07:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:07:14 INFO - Running setup.py (path:/tmp/pip-UZg4wN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:07:14 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:07:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:07:14 INFO - Running setup.py (path:/tmp/pip-XGbv9z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:07:14 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:07:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:07:14 INFO - Running setup.py (path:/tmp/pip-9pXX1E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:07:14 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:07:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:07:14 INFO - Running setup.py (path:/tmp/pip-ELGhYf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:07:14 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:07:14 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:07:14 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:07:14 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:07:14 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:07:14 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:07:14 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:07:14 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:07:14 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:07:14 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:07:14 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:07:14 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:07:14 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:07:16 INFO - Downloading blessings-1.5.1.tar.gz 04:07:16 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 04:07:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:07:16 INFO - Installing collected packages: blessings 04:07:16 INFO - Running setup.py install for blessings 04:07:16 INFO - Successfully installed blessings 04:07:16 INFO - Cleaning up... 04:07:16 INFO - Return code: 0 04:07:16 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:07:16 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:07:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:07:16 INFO - Reading from file tmpfile_stdout 04:07:16 INFO - Current package versions: 04:07:16 INFO - argparse == 1.2.1 04:07:16 INFO - blessings == 1.5.1 04:07:16 INFO - blobuploader == 1.2.4 04:07:16 INFO - docopt == 0.6.1 04:07:16 INFO - manifestparser == 1.1 04:07:16 INFO - mozInstall == 1.12 04:07:16 INFO - mozcrash == 0.16 04:07:16 INFO - mozdebug == 0.1 04:07:16 INFO - mozdevice == 0.47 04:07:16 INFO - mozfile == 1.2 04:07:16 INFO - mozhttpd == 0.7 04:07:16 INFO - mozinfo == 0.9 04:07:16 INFO - mozleak == 0.1 04:07:16 INFO - mozlog == 3.1 04:07:16 INFO - moznetwork == 0.27 04:07:16 INFO - mozprocess == 0.22 04:07:16 INFO - mozprofile == 0.28 04:07:16 INFO - mozrunner == 6.11 04:07:16 INFO - mozscreenshot == 0.1 04:07:16 INFO - mozsystemmonitor == 0.0 04:07:16 INFO - moztest == 0.7 04:07:16 INFO - mozversion == 1.4 04:07:16 INFO - psutil == 3.1.1 04:07:16 INFO - requests == 1.2.3 04:07:16 INFO - wsgiref == 0.1.2 04:07:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:07:16 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:07:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:16 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:07:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f06c6394f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2576dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26093d0>, '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 0x2574ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2575360>, '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': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', '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:07:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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:07:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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:07:16 INFO - Using env: {'DISPLAY': ':0', 04:07:16 INFO - 'HOME': '/home/cltbld', 04:07:16 INFO - 'LANG': 'en_US.UTF-8', 04:07:16 INFO - 'LANGUAGE': 'en_US:en', 04:07:16 INFO - 'LOGNAME': 'cltbld', 04:07:16 INFO - 'MAIL': '/var/mail/cltbld', 04:07:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:16 INFO - 'MOZ_NO_REMOTE': '1', 04:07:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:07:16 INFO - 'NO_EM_RESTART': '1', 04:07:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:07:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:16 INFO - 'PWD': '/builds/slave/test', 04:07:16 INFO - 'SHELL': '/bin/bash', 04:07:16 INFO - 'SHLVL': '1', 04:07:16 INFO - 'TERM': 'linux', 04:07:16 INFO - 'TMOUT': '86400', 04:07:16 INFO - 'USER': 'cltbld', 04:07:16 INFO - 'XDG_SESSION_COOKIE': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', 04:07:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:16 INFO - '_': '/tools/buildbot/bin/python'} 04:07:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:16 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:07:16 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:07:16 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:07:16 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:07:16 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:07:16 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:07:16 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:07:16 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:07:16 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:07:16 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:07:16 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:07:16 INFO - Cleaning up... 04:07:16 INFO - Return code: 0 04:07:16 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:07:16 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:07:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:16 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:07:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f06c6394f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2576dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26093d0>, '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 0x2574ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2575360>, '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': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', '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:07:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 04:07:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 04:07:16 INFO - Using env: {'DISPLAY': ':0', 04:07:16 INFO - 'HOME': '/home/cltbld', 04:07:16 INFO - 'LANG': 'en_US.UTF-8', 04:07:16 INFO - 'LANGUAGE': 'en_US:en', 04:07:16 INFO - 'LOGNAME': 'cltbld', 04:07:16 INFO - 'MAIL': '/var/mail/cltbld', 04:07:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:16 INFO - 'MOZ_NO_REMOTE': '1', 04:07:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:07:16 INFO - 'NO_EM_RESTART': '1', 04:07:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:07:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:16 INFO - 'PWD': '/builds/slave/test', 04:07:16 INFO - 'SHELL': '/bin/bash', 04:07:16 INFO - 'SHLVL': '1', 04:07:16 INFO - 'TERM': 'linux', 04:07:16 INFO - 'TMOUT': '86400', 04:07:16 INFO - 'USER': 'cltbld', 04:07:16 INFO - 'XDG_SESSION_COOKIE': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', 04:07:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:16 INFO - '_': '/tools/buildbot/bin/python'} 04:07:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:17 INFO - Downloading/unpacking jsonschema 04:07:17 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:07:17 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:07:17 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:07:17 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:07:17 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:07:17 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:07:18 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:07:18 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fjsonschema-2.5.1-py2.py3-none-any.whl 04:07:18 INFO - Downloading/unpacking functools32 (from jsonschema) 04:07:18 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:07:18 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:07:18 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:07:18 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:07:18 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:07:18 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:07:19 INFO - Downloading functools32-3.2.3-2.tar.gz 04:07:19 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 04:07:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:07:19 INFO - warning: no files found matching '*.txt' 04:07:19 INFO - no previously-included directories found matching 'build' 04:07:19 INFO - no previously-included directories found matching 'dist' 04:07:19 INFO - no previously-included directories found matching '.git*' 04:07:19 INFO - Installing collected packages: jsonschema, functools32 04:07:19 INFO - Running setup.py install for functools32 04:07:19 INFO - warning: no files found matching '*.txt' 04:07:19 INFO - no previously-included directories found matching 'build' 04:07:19 INFO - no previously-included directories found matching 'dist' 04:07:19 INFO - no previously-included directories found matching '.git*' 04:07:19 INFO - Successfully installed jsonschema functools32 04:07:19 INFO - Cleaning up... 04:07:19 INFO - Return code: 0 04:07:19 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 04:07:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:07:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:07:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:07:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:07:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:07:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f06c6394f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24a78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2576dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26093d0>, '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 0x2574ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2575360>, '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': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', '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:07:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 04:07:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 04:07:19 INFO - Using env: {'DISPLAY': ':0', 04:07:19 INFO - 'HOME': '/home/cltbld', 04:07:19 INFO - 'LANG': 'en_US.UTF-8', 04:07:19 INFO - 'LANGUAGE': 'en_US:en', 04:07:19 INFO - 'LOGNAME': 'cltbld', 04:07:19 INFO - 'MAIL': '/var/mail/cltbld', 04:07:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:19 INFO - 'MOZ_NO_REMOTE': '1', 04:07:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:07:19 INFO - 'NO_EM_RESTART': '1', 04:07:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:07:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:19 INFO - 'PWD': '/builds/slave/test', 04:07:19 INFO - 'SHELL': '/bin/bash', 04:07:19 INFO - 'SHLVL': '1', 04:07:19 INFO - 'TERM': 'linux', 04:07:19 INFO - 'TMOUT': '86400', 04:07:19 INFO - 'USER': 'cltbld', 04:07:19 INFO - 'XDG_SESSION_COOKIE': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', 04:07:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:19 INFO - '_': '/tools/buildbot/bin/python'} 04:07:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:07:19 INFO - Downloading/unpacking flake8 04:07:19 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:07:19 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:07:19 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:07:19 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:07:19 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:07:19 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:07:21 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 04:07:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fflake8-2.5.0-py2.py3-none-any.whl 04:07:21 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 04:07:21 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:07:21 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:07:21 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:07:21 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:07:21 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:07:21 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:07:21 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 04:07:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmccabe-0.3.1-py2.py3-none-any.whl 04:07:21 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 04:07:21 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:07:21 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:07:21 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:07:21 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:07:21 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:07:21 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:07:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpyflakes-1.0.0-py2.py3-none-any.whl 04:07:21 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 04:07:21 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:07:21 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:07:21 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:07:21 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:07:21 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:07:21 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:07:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 04:07:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 04:07:21 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:07:21 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:07:21 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:07:21 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:07:21 INFO - no previously-included directories found matching 'docs/_build' 04:07:21 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 04:07:21 INFO - Running setup.py install for pep8 04:07:22 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:07:22 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:07:22 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:07:22 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:07:22 INFO - no previously-included directories found matching 'docs/_build' 04:07:22 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 04:07:22 INFO - Successfully installed flake8 mccabe pyflakes pep8 04:07:22 INFO - Cleaning up... 04:07:22 INFO - Return code: 0 04:07:22 INFO - Running post-action listener: _resource_record_post_action 04:07:22 INFO - Running post-action listener: _start_resource_monitoring 04:07:22 INFO - Starting resource monitoring. 04:07:22 INFO - ##### 04:07:22 INFO - ##### Running install step. 04:07:22 INFO - ##### 04:07:22 INFO - Running pre-action listener: _resource_record_pre_action 04:07:22 INFO - Running main action method: install 04:07:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:07:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:07:22 INFO - Reading from file tmpfile_stdout 04:07:22 INFO - Detecting whether we're running mozinstall >=1.0... 04:07:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:07:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:07:22 INFO - Reading from file tmpfile_stdout 04:07:22 INFO - Output received: 04:07:22 INFO - Usage: mozinstall [options] installer 04:07:22 INFO - Options: 04:07:22 INFO - -h, --help show this help message and exit 04:07:22 INFO - -d DEST, --destination=DEST 04:07:22 INFO - Directory to install application into. [default: 04:07:22 INFO - "/builds/slave/test"] 04:07:22 INFO - --app=APP Application being installed. [default: firefox] 04:07:22 INFO - mkdir: /builds/slave/test/build/application 04:07:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 04:07:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 04:07:37 INFO - Reading from file tmpfile_stdout 04:07:37 INFO - Output received: 04:07:37 INFO - /builds/slave/test/build/application/firefox/firefox 04:07:37 INFO - Running post-action listener: _resource_record_post_action 04:07:37 INFO - ##### 04:07:37 INFO - ##### Running run-tests step. 04:07:37 INFO - ##### 04:07:37 INFO - Running pre-action listener: _resource_record_pre_action 04:07:37 INFO - Running main action method: run_tests 04:07:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:07:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:07:37 INFO - Python 2.7.3 04:07:37 INFO - Return code: 0 04:07:37 INFO - grabbing minidump binary from tooltool 04:07:37 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:07:37 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 0x26093d0>, '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 0x2574ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2575360>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:07:37 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:07:37 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:07:37 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:07:37 INFO - Return code: 0 04:07:37 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:07:37 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:07:37 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:07:37 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:07:37 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:07:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 04:07:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 04:07:38 INFO - Return code: 0 04:07:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-044', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 04:07:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-044 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 04:07:38 INFO - Using env: {'DISPLAY': ':0', 04:07:38 INFO - 'HOME': '/home/cltbld', 04:07:38 INFO - 'LANG': 'en_US.UTF-8', 04:07:38 INFO - 'LANGUAGE': 'en_US:en', 04:07:38 INFO - 'LOGNAME': 'cltbld', 04:07:38 INFO - 'MAIL': '/var/mail/cltbld', 04:07:38 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:07:38 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:07:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:07:38 INFO - 'MOZ_NO_REMOTE': '1', 04:07:38 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:07:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:07:38 INFO - 'NO_EM_RESTART': '1', 04:07:38 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:07:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:07:38 INFO - 'PWD': '/builds/slave/test', 04:07:38 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:07:38 INFO - 'SHELL': '/bin/bash', 04:07:38 INFO - 'SHLVL': '1', 04:07:38 INFO - 'TERM': 'linux', 04:07:38 INFO - 'TMOUT': '86400', 04:07:38 INFO - 'USER': 'cltbld', 04:07:38 INFO - 'XDG_SESSION_COOKIE': '0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997', 04:07:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:07:38 INFO - '_': '/tools/buildbot/bin/python'} 04:07:38 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-044', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 04:07:39 INFO - mozversion application_buildid: 20151230025438 04:07:39 INFO - mozversion application_changeset: 635705bebbd3913910336ebfa7b9b9a7dd82e906 04:07:39 INFO - mozversion application_display_name: Nightly 04:07:39 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:07:39 INFO - mozversion application_name: Firefox 04:07:39 INFO - mozversion application_remotingname: firefox 04:07:39 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:07:39 INFO - mozversion application_vendor: Mozilla 04:07:39 INFO - mozversion application_version: 46.0a1 04:07:39 INFO - mozversion platform_buildid: 20151230025438 04:07:39 INFO - mozversion platform_changeset: 635705bebbd3913910336ebfa7b9b9a7dd82e906 04:07:39 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:07:39 INFO - mozversion platform_version: 46.0a1 04:07:39 INFO - using testdate: 1451477259 04:07:39 INFO - actual date: 1451477259 04:07:39 INFO - starting webserver on 'localhost:40425' 04:07:39 INFO - SUITE-START | Running 3 tests 04:07:39 INFO - TEST-START | dromaeo_css 04:07:39 INFO - operating with platform_type : linux_ 04:07:39 INFO - Initialising browser for dromaeo_css test... 04:07:39 INFO - TEST-INFO | started process 29585 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp9Jg2j0/profile http://localhost:40425/getInfo.html) 04:07:43 INFO - PROCESS | 29585 | __metrics Screen width/height:1600/1200 04:07:43 INFO - PROCESS | 29585 | colorDepth:24 04:07:43 INFO - PROCESS | 29585 | Browser inner width/height: 1024/697 04:07:43 INFO - PROCESS | 29585 | __metrics 04:07:43 INFO - PROCESS | 29585 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 04:07:43 INFO - PROCESS | 29585 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:07:44 INFO - TEST-INFO | 29585: exit 0 04:07:44 INFO - Browser initialized. 04:07:44 INFO - Running cycle 1/1 for dromaeo_css test... 04:07:44 INFO - TEST-INFO | started process 29677 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp9Jg2j0/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:07:56 INFO - PROCESS | 29677 | RSS: Main: 149532672 04:07:56 INFO - PROCESS | 29677 | 04:08:48 INFO - PROCESS | 29677 | 1451477328030 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:10:59 INFO - PROCESS | 29677 | Cycle 1(1): loaded http://localhost:40425/tests/dromaeo/cssquery-dojo.html (next: http://localhost:40425/tests/dromaeo/cssquery-ext.html) 04:11:01 INFO - PROCESS | 29677 | RSS: Main: 251097088 04:11:01 INFO - PROCESS | 29677 | 04:14:03 INFO - PROCESS | 29677 | Cycle 1(1): loaded http://localhost:40425/tests/dromaeo/cssquery-ext.html (next: http://localhost:40425/tests/dromaeo/cssquery-jquery.html) 04:14:04 INFO - PROCESS | 29677 | RSS: Main: 222134272 04:14:04 INFO - PROCESS | 29677 | 04:17:06 INFO - PROCESS | 29677 | Cycle 1(1): loaded http://localhost:40425/tests/dromaeo/cssquery-jquery.html (next: http://localhost:40425/tests/dromaeo/cssquery-mootools.html) 04:17:06 INFO - PROCESS | 29677 | RSS: Main: 230551552 04:17:06 INFO - PROCESS | 29677 | 04:20:08 INFO - PROCESS | 29677 | Cycle 1(1): loaded http://localhost:40425/tests/dromaeo/cssquery-mootools.html (next: http://localhost:40425/tests/dromaeo/cssquery-prototype.html) 04:20:09 INFO - PROCESS | 29677 | RSS: Main: 212430848 04:20:09 INFO - PROCESS | 29677 | 04:23:12 INFO - PROCESS | 29677 | Cycle 1(1): loaded http://localhost:40425/tests/dromaeo/cssquery-prototype.html (next: http://localhost:40425/tests/dromaeo/cssquery-yui.html) 04:23:12 INFO - PROCESS | 29677 | RSS: Main: 194068480 04:23:12 INFO - PROCESS | 29677 | 04:26:15 INFO - PROCESS | 29677 | Cycle 1(1): loaded http://localhost:40425/tests/dromaeo/cssquery-yui.html (next: http://localhost:40425/tests/dromaeo/cssquery-dojo.html) 04:26:15 INFO - PROCESS | 29677 | RSS: Main: 261152768 04:26:15 INFO - PROCESS | 29677 | 04:26:15 INFO - PROCESS | 29677 | __start_tp_report 04:26:15 INFO - PROCESS | 29677 | _x_x_mozilla_page_load 04:26:15 INFO - PROCESS | 29677 | _x_x_mozilla_page_load_details 04:26:15 INFO - PROCESS | 29677 | |i|pagename|runs| 04:26:15 INFO - PROCESS | 29677 | |0;dojo.html;2589.2522547280582;2694.474577457394;2696.0601029966742;2705.3371923878653;2724.0193530329084;4429.557044295569;4550.977245113778;4604.378408914796;4608.078384323137;4608.631309495237;4566.1780879441685;4588.81644734211;4647.000894807616;4652.046330502248;4658.580727734503;4221.32458806591;4231.555686652903;4328.091100868814;4349.565043495657;4377.606015458608;4146.419501269825;4325.891852703692;4341.674374421915;4373.103513779667;4404.361367601712;4171.478565179353;4267.679924005696;4271.8718438446895;4277.615014648696;4295.248331541968;4252.766097864616;4259.787010649455;4269.274223382033;4285.700000999931;4315.5900189481945;4126.979365103155;4245.915081698348;4260.595243451898;4269.039466120129;4306.720063195882;4485.708428952108;4485.932711009337;4539.500654927955;4629.976850115728;4678.485366609671;4942.802287908479;4952.257161425779;4969.875753106165;5004.699718016931;5009.44896061433;4765.880852978668;4978.626603004789;4985.875353116165;4994.775235114393;4996.925046124275;4516.819327226907;4525.796339164745;4586.036932244199;4665.720056796603;4696.530346965276;5063.848084557396;5079.4412614612365;5079.974600126976;5082.923756143661;5084.3898732152375;4881.8535443936735;4882.462929077798;4885.022995400934;4886.120498310338;4924.679895806761;4686.835960741358;4785.210440277385;4785.282207668808;4922.90154196914;4951.183054795918;4956.132676781549;4961.454240033593;4964.627652925973;4966.528179822911;5009.323741294878;4926.531979461945;4937;4937.604991600663;4942.184539551005;4984.327115839315;4005.959940400617;4137.668986481074;4138.979305103516;4214.683898707609;4249.702520823513;3647.708183345326;3676.4301533262387;3701.3152566775234;3717.8326975286177;3729.9627003730157;4264.87205383839;4275.40144379787;4282.036541778075;4315;4321.092570560155;4753.04939012199;4867.610591152699;4870.707757534488;4997.175466048134;5003.3495645565845;4237.0466645005245;4288.892777680583;4302.440682711227;4329.870103896888;4334.13317336534;4454.688171827941;4460.1971645104195;4463.419755431773;4486.035502366942;4490.865274041784;4509.932351014671;4610.631149508098;4742.478327383985;4752.405949256343;4752.7385993769985;4780.832670856643;4871.098846713369;4926.605871530197;4944.728039957693;4984.302197692254;4727.598154156935;4735.502772209006;4738.763061846825;4739.644526660583;4785.162596545521;4695.577398034194;4779.283107533759;4901.019796040735;4901.264810278487;4949.9257511138085;4856.8300109495995;4933.087378834927;4994.425641051181;4997.300377947017;5054.772535235849;4824.782884770124;4843.200871856105;4845.176320025675;4849.442314133778;4895.094407534618;4592.517785632461;4715.009847931973;4793.472718001087;4812.446568644651;4857.684250523705;4564.680472366902;4655.2784318430695;4715.78778954941;4716.6698331116495;4754.025424787841;4824.807007719793;4856.368672072608;4856.68431551948;4860.1008813369635;4909.5090490950615;4546.636269098398;4701.412323459567;4714.222153344797;4750.857474275777;4789.784459699392 04:26:15 INFO - PROCESS | 29677 | |1;ext.html;502.70591703853245;506.0435776382635;506.30636028640754;529.6795438759549;533.7438029745724;24920.127795527136;25365.49269014621;32663;33058.8347058265;33220.50169247457;35979.46030809533;36357;36481.27037459256;36482.27035459289;36510;6832.975053741954;7498.662560184791;7646.311831935125;7661.770146895602;7664.846703065935;6933.064036355103;9806.558704858298;9958;10008.94995525025;10022.89977100227;9647.131758141766;9707.514624268793;9800.950995245013;9802.460864652441;9806.264530160232;7023.578585284899;7152.7496537621455;9552.61789528418;9587.424754514752;9683.370580912253;9429.15137637609;9597.90402095984;9603.519824008841;9604.615815367377;9608.66369677058;35047.64952350495;35792.821035894915;35817.64182358169;35848.64151358479;35929;2822.3367508635456;3469.2887957968555;3479.1128262292955;3507.473878918183;3530.6645868642436;28130.859345703346;28198.85900570484;28214.576781348296;28336.43327133446;28390.574141387897;3077.4152910947073;3082.352705931757;3146.1505393543616;3151.5453639082752;3161.65221825599;217667;218715;219453;219539.90230048908;219689;44845.327320090226;51802.740986294826;52099.47900521022;52250;52266.738666306424;44118;44557.331640025426;44573.55426445694;55547.44452555504;56945.43054569484;12878.420471078636;13200.471981120647;13204.801927971088;13215.339233038501;13217.669558260928;9775.560099795526;9864.704058878246;9920;9931.602735890483;9939.65211217604;17590.648187036186;17958.5510362242;17970.640587188183;17973.191206395742;17997.910010450127;7039.331263529956;7277.19950805411;7286.453515986323;7348.485606007528;7389.445791565654;752.6476538019101;863.4042510667745;868.7524055644111;909.4997751236793;969.4667932637021;26372.868135659584;26377.472450550882;26409.679516024506;26446.206613801616;26605.3348666281;910.5720311453606;940.7177846645978;941.0542404883186;971.4996776660025;972.8589354543693;12959.805602915963;12983.221006739626;13025.47898084085;13156.40796164175;13185.868141318655;267424;270567;271180;271196;271813;43545.34681979773;44236.55763442325;44430;44481.55351455636;44501;1154.6593754842174;1168.4099529737598;1180.598596477202;1193.373478923572;1195.5277665322149;21761.78238217661;23887.283381498582;24232.273031809073;24719.50560988806;25626.48747025012;35453;36029.27941441104;36061;36064.27871442504;36102.27795444129;165620;167336;167351;167548.16225918793;167560;23967.52064958656;24615.63076553889;27845.86077069683;28017.579736303564;28167.859160704065;32167.839160804047;32217.194570135933;32621;32887;32996.67003329936;28035.299117522227;28639.570406444338;29409.264768380963;30558.236044098187;30891.2277193063;31063.223419414695;34308.87482883041;35024.12439688926;35753;36039.81980090083;31314.686853132087;31614.209644759067;31621.841890790398;31641;31644;27648.861755691094;27817.16548503467;29019.12942611725;29926.551101733057;29950.400991980474;21154.259600913894;21473.355799326044;22690.20584279542;22893.198738044754;22981.54036919219 04:26:15 INFO - PROCESS | 29677 | |2;jquery.html;331.48785126978817;333.70133730311375;333.77136661386936;335.0969138172625;340.3108704872633;12403.44184511697;12802.423890924907;14757.852421475782;15108.848911510882;15511.922440387796;8551.273141782956;8556.70051548196;9309.534523273844;9399.953000235006;12514.998800095971;4399.252127138386;4560.703554268978;4561.384213131218;4561.6806823522365;4564.817407303721;3440.9483857742152;3542.0436482149803;4136.524299705542;4481.058977614704;5131.4098878629065;5079.644424890259;5090.10923088458;5119.308893299412;5126.5898728101665;5127.769250383742;4981.601471882259;5725.914111288293;5730.312362516483;5733.369329373786;5737.397573254811;5042.647014708972;5078.415982162025;5095.821646242363;5097.7196254206;5110.616703747197;17701.380451684257;17812.91093544537;18177.72733409;18393.724094138597;18394.540136496562;1599.3362754457003;1651.067147061906;1682.8653707703477;1726.1973182470085;1726.3439892840765;8522.57387130641;11819.881801181964;12146.392680365947;12408.317542535156;12528.686782830411;1719.7678313427652;1726.8014178369397;1746.1007581095619;1753.7194048952106;1811.2573844723731;53994;56904.86190276171;56997.71501142509;57338.426615733726;57637.71181144109;9452.43285402878;9459.195968342769;9483.762905927408;9495.715128546155;9837.655682051238;12020.699482513008;12027.338496382608;12030.939845300718;12044.939775301067;12048.939755301168;6816;6864;6899.931000689929;6909.205441374306;6993.615351155735;6448.161738973997;6465.418112369815;6566.080748695091;6635.236947750974;6644.933550664431;4116.382542618631;4163.125743593819;4174.3112386456505;4175.54069052404;4200.894977625584;1621.391978008247;1684.5367523930772;1693.8814283000072;1721.4147189955474;1763.647270545896;754.0574282147315;807.5921659562001;826.4710585225461;894.5169608411516;913.3104506097853;14554.490592829201;14760.335784889705;15797.21013949298;15856.9871724372;16817.243224054946;731.915829679583;758.9734359297398;774.0401901642036;808.5027707959563;838.5388036579857;8045.597720114088;8257.545834979133;8412.453190542596;8477;8620.913790862136;530655;537664;544017;553354;567385;67276;70102.29897700957;70587.64706176538;71590;72143;1050.9369437833907;1051.106559424483;1078.660222030058;1110.0176343935514;1110.4836251143095;14549.563513094625;14597.467265936924;14640.26798660084;14842.851571484147;15090.396384144951;31164.376712466077;31333.373332533676;32008.83995580007;32402.675973239966;32861.178470537474;41996.21950675011;42196.156076877676;42676.012679112166;42787;44729.77635111934;8137.3490120791375;8319.209675080858;8356.164383561596;8392.370572207232;8406.369522285731;9663.275254356093;11890.76218475643;16106.436274730328;16165.919170404073;16224.918875405547;12456.56402025961;13140.408681609159;13295.20228786276;13657;13823;12486.875131248571;12794.488220471078;12947.352632368533;13363.799543007057;13456.192628442324;10655.946720266658;11979;13287.534936277183;13837.861621383658;13921.512747053805;7991.64037618297;8158.673653053811;8158.877616835871;8175.83648327042;8475.237228649452;8610.268127209007;8788.91211087881;10336.586536538754;12788.36058197105;12998 04:26:15 INFO - PROCESS | 29677 | |3;mootools.html;1226.2519862883646;1394.8884089272858;1403.312376935302;1527.3966783120668;1751.7022106241939;5688.971555142223;6925.619090949996;6996.685149168287;7010;7010.228874823778;6754.898676519856;6911.481638877091;6916.654167291628;6929.411000064988;6941.1670599528;1750.7636469076704;1788.588624616339;2025.2405347994466;2027.1587291274177;2055.4758536573227;2078.044099714133;2091.1321801452455;2091.2471510256296;2093.2359688713586;2093.256893802701;1976.3675623800389;2012.4264584593393;2013.597280543897;2014.0131335645501;2014.7985201479808;2027.5336672565245;2039.276056999766;2043.5606344635826;2075.2425364741835;2075.584883023394;2074.09776747114;2109;2110.7150534677776;2112.7323605836377;2119.5231073008604;7188.784336469915;7231.855362892766;7242.311980361857;7262.382697470668;7266.309700578437;4198.097409057037;4240.724352917051;4260.808263628144;4265.0830071534765;4266.445362102938;2661.534231509478;2685.375347914503;2759.103291430273;2762.4889395461905;2781.582762585608;878.1174919206221;880.7886107334193;890.3500444675359;896.753392816974;915.8443064678954;9479.431234125974;9493.762655933588;9499.192568631675;9505.287103467199;9536.90463095374;3728.515293011891;3761.981190094032;3806.410006449005;3833.5974722654278;3858.3826587745825;8252.628631711468;8254.628541715638;8260.710875119343;8306.584670766437;8309.6676132954;4226.197022565702;4259.105587826529;4261.019965407973;4261.360795880581;4263.488381394191;3867.323218436762;3894.2600905827803;3901.08324543732;3901.122247494291;3901.51231096113;2984.4777163996646;3026.8940587079346;3357.983210083934;3416.8633254669535;3463.8441270142903;1063.3885515828429;1067.3595842494442;1071.5285274479204;1073.592035026685;1080.4381721504774;885.0080231539256;911.886014248219;959.4962644611635;1159.3797318434597;1169.8713141554422;6728.259891411941;6785.389314961677;6819.386255236953;6842.178938527409;6847.965760171167;1016.9389836609679;1028.953697083633;1030.6598822388594;1031.8452232165084;1053.5311786255043;5208.0365132450615;5267.26258323835;5280.867978300496;5300.8409747706855;5319.441458646864;8181.550014749246;8279.95860020696;8334.958130233721;8482.915170848213;8825;8231.42380033392;8240.917590824134;8241.79395515117;8243.752687419386;8245.175482451707;6532.248791388956;6547.869042619121;6588.769393071316;6633.137692100093;6711.228208756055;6287.088372186099;6329.113924050729;6335.90496142549;6339.778107766206;6341.365863413622;7426.480146389917;7441.4046876248685;7600.809979750329;7663.616819158909;7669.271419215165;7672.117706463605;7695.961520192363;7818.765437036898;7846.489978151402;7867.606619669108;6256.843578910563;6329.810105696836;6340.4293613575;6358.459530939922;6363.427291543783;5581.720913954205;6570.375814297634;6692.665366731741;6735.562188457735;6752.527323087336;6372.713227904848;6402.167718196791;6483.7730679425995;6554.705038273194;6562.114114594468;6370.490360771035;6402.711877965596;6413.230412350548;6445.935540644534;6502.772402965874;6466.708998095003;6492.5455218134275;6520.445762110274;6528.67356632176;6538.313477084837;5864.501517371071;5896.469317761422;5901.675407852437;5914.467697907037;5914.497267732291;5690.601657883908;5812.128180772918;5913.787673527003;5920.585559010828;5947.583669143119 04:26:15 INFO - PROCESS | 29677 | |4;prototype.html;307.686160116681;314.18155704390057;316.58369244443554;317.9825109618973;318.74341155369916;5264.236685680578;5369.4362091980365;5392.973035134829;5396;5398.163284690874;5279.973600132003;5290.153575427932;5290.814821481249;5290.973545132279;5315.441878602749;3940.5074365704286;4035.475388199545;4188.4136220929095;4190.832366705344;4193.035601811585;4031.2340655275552;4053.6351728344443;4138.8965275868195;4141.295979683446;4153.314703073989;4056.452378928851;4096.467459230296;4113.814878330482;4121.052158003646;4126.133511962492;3884.6309600587897;3952.664023558001;4092.1406504634065;4093.815778289984;4099.098198396348;3594.478800573902;3628.600853906068;3674.595794462607;3685.760425572356;3695.5011073505;5084.262781896604;5141.845744627667;5147.305113809625;5150.896982060375;5162.638615296931;4758.477287268076;4759.428868535763;4765.428148622153;4765.69023013503;4776.450708168571;5399.136138217867;5553.694546799924;5559.332880054379;5560.805371811967;5561.416051314634;3997.040710229553;3998.9400158997637;3999.1002024544537;4000.7799571023584;4007.8998025049314;5854.385289544622;5858.355580886099;5858.3848695886745;5871.324797648283;5874.73563689635;4134.627883490501;4140;4142.772147531915;4143.91712165755;4147.730397524211;3947.4078888167005;4207.242696314632;4208.684348673862;4210.115875666083;4211.241976444208;4603.8950651843315;4649.767511624405;4651.395318608559;4652.371929789503;4657.394538709946;5590.720463976785;5593.300837395325;5595.356533998643;5599.272094627672;5602.52378547828;1434.6126545832567;1448.7537118689847;1449.9565013049626;1450.4198320671605;1450.9709805804036;959.5777857742711;964.1584573464648;983.7442265011006;1000.559753708366;1003;4844.515548445127;4852.8544143675745;4857.8299759508955;4859.222524396079;4870.902581948412;5813.331466881278;5815.156802263648;5819.53443724501;5819.73811178498;5822.039363504974;4866.683665561727;4873.19592267279;4875.219964805614;4880.097182021337;4880.316755654211;3034.2717747740385;3092;3092.6134233220846;3093.149383919395;3121.250899784081;5528.391876893538;5545.500904918496;5557.36090349615;5558.305211848519;5558.471945165203;5994.340622531518;6014.789482368096;6018.458338749533;6029.3970602940235;6031.819045428644;5494.725263736797;5500.092484739973;5535.142052981794;5542.667439953616;5553.111502159635;5671.120976248688;5832.533397328289;5842.065269556851;5844.094165404369;5851.561132914963;5698.914516282176;5702.45826646468;5705.515031222392;5708.315002199763;5710.428957104256;5534.861628459321;5536.307961504812;5536.7785288588;5540;5545.445455454423;3949.6445319921345;3997.8800635980965;4034.5965403460596;4042;4052.2098190852503;5813.476787089182;5813.738381772746;5831.825045248649;5840.561957853093;5841.240638716939;5598.69207193592;5615.691136987505;5617.101263797773;5620.269364982526;5621.971890140523;5606.495415412633;5610.457124290852;5610.775568977195;5622.269105016322;5624.831255062355;5345.305110335631;5491.368492623399;5494.890102197854;5500.50495455395;5501.367342755474;5402;5502.119660854244;5620.269364982526;5650.124230744241;5671.007573674673;5381.381141168659;5514.889702206014;5537.390887002346;5541.473560011793;5542.722863856871 04:26:15 INFO - PROCESS | 29677 | |5;yui.html;663.2704025571871;694.9895751563728;757.8105473631591;760.5740785160314;765.808547863034;11455.942720286397;11618.419079046056;11648.825267620992;11656.417179141052;11659.475323610437;10650.840237396425;11228.494717737702;11233.04519115874;11237.831432528497;11258.268212566178;615.22481673092;621.1397214857433;765.3991616580985;766.9003029606143;782.7612578163657;782.35846605783;784.9529028258294;791.2325044706654;791.5409062743623;792.2354927494966;822.391430341546;833.1002517281352;833.5957060825494;834.5827086456771;834.5952213176605;648.1703419622891;656.0421784195081;809.0412860760018;830.5473516933225;832.0888626953476;584.9122631605251;593.717983957621;603.0863242188088;603.2941458493573;603.4267445926388;11462.885371146265;11607.6517704469;11609.709757256052;11614.128940329509;11624.476898539502;10816.351018938889;10819.13446924244;10908.34549927007;11002.50488728009;11355;8664.740057798275;8697.217250447427;8788.736337909873;8837.734867953908;9156.084391560857;3095.5820964169775;3124.2033281513295;3143.842807859598;3192.090254277543;3199.96800031999;37985.24029519422;38228.61771382279;38270.23459530822;38637.806810966045;40208;9334.579943902541;9365.672201472917;9414.811703765887;9469.195118414875;9481.620735170516;16992.32030718782;17024.14879256032;17032.914835425992;17051.147442628066;17096.743548846778;6207.224096987877;6394.84012899672;6445.677716114175;6451.225852897588;6637.668116594151;3352.7150192233935;3467.791932484059;3491.319192757439;3521;3628.6552777486095;2602.7137014928344;2629.421527263999;2635.3543381871564;2635.644188034629;2644.0613582178435;498.5737194698553;504.01465135659697;508.2579434026363;509.42435048395816;515.5875299760177;382.5963608393172;425.88501104701555;428.2890401932777;465.4205514134924;520.1132069820947;6823.351781580742;7027.718891244395;7027.8594428111155;7181.35367816899;7278.308560686726;494.1500618935497;516.7958656330728;535.4725595288637;535.8365698462006;554.9916751248735;3035.5598438226334;3209.1816586770224;3251.170951407376;3276.885309014173;3281;50605;52606.73696631492;53335.46664533305;53709;53752.73123634357;43612.12775744467;44509.77745111254;44833.55166448359;44838.775806120764;45128.54871451309;40092.19815603671;40470.79764601217;41034.58965410367;41503.58496415058;41629.375559366636;7311.159216690149;7554.320111190019;7560.206178351194;7570.1672815989095;7681.155072942083;30176;30347.544786828657;30355.696443035285;30813.691863081083;31008.844955775076;38326.61673383231;38456.615433845305;39227.803860980515;39489.81530554088;39601.207975840895;9632.75918102053;9798.412095274307;10222;10321.225908057077;10332.586696532355;10750.301230419998;10751.6236931707;10844.132469402586;10865.837012444978;10881.891181088087;9159.43876280865;9490.145886870216;9619.759506012406;9679.322447428613;9973.551190196313;9737.123658870736;9958.253131015057;9966.352187107816;10214.591416343561;10569.894301056891;8301.252887240178;8304.626291817003;8719.825603488021;9693.806123877343;10509.632162874263;9099.681511147079;9173.633054677739;9417.387869788441;9608.9039109608;9641.662541811003;7428.517146385684;7516.135644400964;7561.243875612395;7632.847343052997;7769.7669069928 04:26:15 INFO - PROCESS | 29677 | __end_tp_report 04:26:15 INFO - PROCESS | 29677 | __start_cc_report 04:26:15 INFO - PROCESS | 29677 | _x_x_mozilla_cycle_collect,922 04:26:15 INFO - PROCESS | 29677 | __end_cc_report 04:26:15 INFO - PROCESS | 29677 | __startTimestamp1451478375678__endTimestamp 04:26:15 INFO - PROCESS | 29677 | 04:26:15 INFO - PROCESS | 29677 | ------- Summary: start ------- 04:26:15 INFO - PROCESS | 29677 | Number of tests: 6 04:26:15 INFO - PROCESS | 29677 | 04:26:15 INFO - PROCESS | 29677 | [#0] dojo.html Cycles:165 Average:4570.96 Median:4696.53 stddev:461.34 (9.8%) stddev-sans-first:435.77 04:26:15 INFO - PROCESS | 29677 | Values: 2589.3 2694.5 2696.1 2705.3 2724.0 4429.6 4551.0 4604.4 4608.1 4608.6 4566.2 4588.8 4647.0 4652.0 4658.6 4221.3 4231.6 4328.1 4349.6 4377.6 4146.4 4325.9 4341.7 4373.1 4404.4 4171.5 4267.7 4271.9 4277.6 4295.2 4252.8 4259.8 4269.3 4285.7 4315.6 4127.0 4245.9 4260.6 4269.0 4306.7 4485.7 4485.9 4539.5 4630.0 4678.5 4942.8 4952.3 4969.9 5004.7 5009.4 4765.9 4978.6 4985.9 4994.8 4996.9 4516.8 4525.8 4586.0 4665.7 4696.5 5063.8 5079.4 5080.0 5082.9 5084.4 4881.9 4882.5 4885.0 4886.1 4924.7 4686.8 4785.2 4785.3 4922.9 4951.2 4956.1 4961.5 4964.6 4966.5 5009.3 4926.5 4937.0 4937.6 4942.2 4984.3 4006.0 4137.7 4139.0 4214.7 4249.7 3647.7 3676.4 3701.3 3717.8 3730.0 4264.9 4275.4 4282.0 4315.0 4321.1 4753.0 4867.6 4870.7 4997.2 5003.3 4237.0 4288.9 4302.4 4329.9 4334.1 4454.7 4460.2 4463.4 4486.0 4490.9 4509.9 4610.6 4742.5 4752.4 4752.7 4780.8 4871.1 4926.6 4944.7 4984.3 4727.6 4735.5 4738.8 4739.6 4785.2 4695.6 4779.3 4901.0 4901.3 4949.9 4856.8 4933.1 4994.4 4997.3 5054.8 4824.8 4843.2 4845.2 4849.4 4895.1 4592.5 4715.0 4793.5 4812.4 4857.7 4564.7 4655.3 4715.8 4716.7 4754.0 4824.8 4856.4 4856.7 4860.1 4909.5 4546.6 4701.4 4714.2 4750.9 4789.8 04:26:15 INFO - PROCESS | 29677 | 04:26:15 INFO - PROCESS | 29677 | [#1] ext.html Cycles:180 Average:37190.57 Median:32941.84 stddev:58012.24 (176.1%) stddev-sans-first:58109.57 04:26:15 INFO - PROCESS | 29677 | Values: 502.7 506.0 506.3 529.7 533.7 24920.1 25365.5 32663.0 33058.8 33220.5 35979.5 36357.0 36481.3 36482.3 36510.0 6833.0 7498.7 7646.3 7661.8 7664.8 6933.1 9806.6 9958.0 10008.9 10022.9 9647.1 9707.5 9801.0 9802.5 9806.3 7023.6 7152.7 9552.6 9587.4 9683.4 9429.2 9597.9 9603.5 9604.6 9608.7 35047.6 35792.8 35817.6 35848.6 35929.0 2822.3 3469.3 3479.1 3507.5 3530.7 28130.9 28198.9 28214.6 28336.4 28390.6 3077.4 3082.4 3146.2 3151.5 3161.7 217667.0 218715.0 219453.0 219539.9 219689.0 44845.3 51802.7 52099.5 52250.0 52266.7 44118.0 44557.3 44573.6 55547.4 56945.4 12878.4 13200.5 13204.8 13215.3 13217.7 9775.6 9864.7 9920.0 9931.6 9939.7 17590.6 17958.6 17970.6 17973.2 17997.9 7039.3 7277.2 7286.5 7348.5 7389.4 752.6 863.4 868.8 909.5 969.5 26372.9 26377.5 26409.7 26446.2 26605.3 910.6 940.7 941.1 971.5 972.9 12959.8 12983.2 13025.5 13156.4 13185.9 267424.0 270567.0 271180.0 271196.0 271813.0 43545.3 44236.6 44430.0 44481.6 44501.0 1154.7 1168.4 1180.6 1193.4 1195.5 21761.8 23887.3 24232.3 24719.5 25626.5 35453.0 36029.3 36061.0 36064.3 36102.3 165620.0 167336.0 167351.0 167548.2 167560.0 23967.5 24615.6 27845.9 28017.6 28167.9 32167.8 32217.2 32621.0 32887.0 32996.7 28035.3 28639.6 29409.3 30558.2 30891.2 31063.2 34308.9 35024.1 35753.0 36039.8 31314.7 31614.2 31621.8 31641.0 31644.0 27648.9 27817.2 29019.1 29926.6 29950.4 21154.3 21473.4 22690.2 22893.2 22981.5 04:26:15 INFO - PROCESS | 29677 | 04:26:15 INFO - PROCESS | 29677 | [#2] jquery.html Cycles:180 Average:27567.98 Median:23198.53 stddev:89276.80 (384.8%) stddev-sans-first:89503.81 04:26:15 INFO - PROCESS | 29677 | Values: 331.5 333.7 333.8 335.1 340.3 12403.4 12802.4 14757.9 15108.8 15511.9 8551.3 8556.7 9309.5 9400.0 12515.0 4399.3 4560.7 4561.4 4561.7 4564.8 3440.9 3542.0 4136.5 4481.1 5131.4 5079.6 5090.1 5119.3 5126.6 5127.8 4981.6 5725.9 5730.3 5733.4 5737.4 5042.6 5078.4 5095.8 5097.7 5110.6 17701.4 17812.9 18177.7 18393.7 18394.5 1599.3 1651.1 1682.9 1726.2 1726.3 8522.6 11819.9 12146.4 12408.3 12528.7 1719.8 1726.8 1746.1 1753.7 1811.3 53994.0 56904.9 56997.7 57338.4 57637.7 9452.4 9459.2 9483.8 9495.7 9837.7 12020.7 12027.3 12030.9 12044.9 12048.9 6816.0 6864.0 6899.9 6909.2 6993.6 6448.2 6465.4 6566.1 6635.2 6644.9 4116.4 4163.1 4174.3 4175.5 4200.9 1621.4 1684.5 1693.9 1721.4 1763.6 754.1 807.6 826.5 894.5 913.3 14554.5 14760.3 15797.2 15857.0 16817.2 731.9 759.0 774.0 808.5 838.5 8045.6 8257.5 8412.5 8477.0 8620.9 530655.0 537664.0 544017.0 553354.0 567385.0 67276.0 70102.3 70587.6 71590.0 72143.0 1050.9 1051.1 1078.7 1110.0 1110.5 14549.6 14597.5 14640.3 14842.9 15090.4 31164.4 31333.4 32008.8 32402.7 32861.2 41996.2 42196.2 42676.0 42787.0 44729.8 8137.3 8319.2 8356.2 8392.4 8406.4 9663.3 11890.8 16106.4 16165.9 16224.9 12456.6 13140.4 13295.2 13657.0 13823.0 12486.9 12794.5 12947.4 13363.8 13456.2 10655.9 11979.0 13287.5 13837.9 13921.5 7991.6 8158.7 8158.9 8175.8 8475.2 8610.3 8788.9 10336.6 12788.4 12998.0 04:26:15 INFO - PROCESS | 29677 | 04:26:15 INFO - PROCESS | 29677 | [#3] mootools.html Cycles:180 Average:4928.81 Median:6308.10 stddev:2543.26 (40.3%) stddev-sans-first:2535.17 04:26:15 INFO - PROCESS | 29677 | Values: 1226.3 1394.9 1403.3 1527.4 1751.7 5689.0 6925.6 6996.7 7010.0 7010.2 6754.9 6911.5 6916.7 6929.4 6941.2 1750.8 1788.6 2025.2 2027.2 2055.5 2078.0 2091.1 2091.2 2093.2 2093.3 1976.4 2012.4 2013.6 2014.0 2014.8 2027.5 2039.3 2043.6 2075.2 2075.6 2074.1 2109.0 2110.7 2112.7 2119.5 7188.8 7231.9 7242.3 7262.4 7266.3 4198.1 4240.7 4260.8 4265.1 4266.4 2661.5 2685.4 2759.1 2762.5 2781.6 878.1 880.8 890.4 896.8 915.8 9479.4 9493.8 9499.2 9505.3 9536.9 3728.5 3762.0 3806.4 3833.6 3858.4 8252.6 8254.6 8260.7 8306.6 8309.7 4226.2 4259.1 4261.0 4261.4 4263.5 3867.3 3894.3 3901.1 3901.1 3901.5 2984.5 3026.9 3358.0 3416.9 3463.8 1063.4 1067.4 1071.5 1073.6 1080.4 885.0 911.9 959.5 1159.4 1169.9 6728.3 6785.4 6819.4 6842.2 6848.0 1016.9 1029.0 1030.7 1031.8 1053.5 5208.0 5267.3 5280.9 5300.8 5319.4 8181.6 8280.0 8335.0 8482.9 8825.0 8231.4 8240.9 8241.8 8243.8 8245.2 6532.2 6547.9 6588.8 6633.1 6711.2 6287.1 6329.1 6335.9 6339.8 6341.4 7426.5 7441.4 7600.8 7663.6 7669.3 7672.1 7696.0 7818.8 7846.5 7867.6 6256.8 6329.8 6340.4 6358.5 6363.4 5581.7 6570.4 6692.7 6735.6 6752.5 6372.7 6402.2 6483.8 6554.7 6562.1 6370.5 6402.7 6413.2 6445.9 6502.8 6466.7 6492.5 6520.4 6528.7 6538.3 5864.5 5896.5 5901.7 5914.5 5914.5 5690.6 5812.1 5913.8 5920.6 5947.6 04:26:15 INFO - PROCESS | 29677 | 04:26:15 INFO - PROCESS | 29677 | [#4] prototype.html Cycles:180 Average:4656.21 Median:5290.89 stddev:1363.55 (25.8%) stddev-sans-first:1327.73 04:26:15 INFO - PROCESS | 29677 | Values: 307.7 314.2 316.6 318.0 318.7 5264.2 5369.4 5393.0 5396.0 5398.2 5280.0 5290.2 5290.8 5291.0 5315.4 3940.5 4035.5 4188.4 4190.8 4193.0 4031.2 4053.6 4138.9 4141.3 4153.3 4056.5 4096.5 4113.8 4121.1 4126.1 3884.6 3952.7 4092.1 4093.8 4099.1 3594.5 3628.6 3674.6 3685.8 3695.5 5084.3 5141.8 5147.3 5150.9 5162.6 4758.5 4759.4 4765.4 4765.7 4776.5 5399.1 5553.7 5559.3 5560.8 5561.4 3997.0 3998.9 3999.1 4000.8 4007.9 5854.4 5858.4 5858.4 5871.3 5874.7 4134.6 4140.0 4142.8 4143.9 4147.7 3947.4 4207.2 4208.7 4210.1 4211.2 4603.9 4649.8 4651.4 4652.4 4657.4 5590.7 5593.3 5595.4 5599.3 5602.5 1434.6 1448.8 1450.0 1450.4 1451.0 959.6 964.2 983.7 1000.6 1003.0 4844.5 4852.9 4857.8 4859.2 4870.9 5813.3 5815.2 5819.5 5819.7 5822.0 4866.7 4873.2 4875.2 4880.1 4880.3 3034.3 3092.0 3092.6 3093.1 3121.3 5528.4 5545.5 5557.4 5558.3 5558.5 5994.3 6014.8 6018.5 6029.4 6031.8 5494.7 5500.1 5535.1 5542.7 5553.1 5671.1 5832.5 5842.1 5844.1 5851.6 5698.9 5702.5 5705.5 5708.3 5710.4 5534.9 5536.3 5536.8 5540.0 5545.4 3949.6 3997.9 4034.6 4042.0 4052.2 5813.5 5813.7 5831.8 5840.6 5841.2 5598.7 5615.7 5617.1 5620.3 5622.0 5606.5 5610.5 5610.8 5622.3 5624.8 5345.3 5491.4 5494.9 5500.5 5501.4 5402.0 5502.1 5620.3 5650.1 5671.0 5381.4 5514.9 5537.4 5541.5 5542.7 04:26:15 INFO - PROCESS | 29677 | 04:26:15 INFO - PROCESS | 29677 | [#5] yui.html Cycles:180 Average:12032.47 Median:512.51 stddev:13980.16 (2727.8%) stddev-sans-first:13993.31 04:26:15 INFO - PROCESS | 29677 | Values: 663.3 695.0 757.8 760.6 765.8 11455.9 11618.4 11648.8 11656.4 11659.5 10650.8 11228.5 11233.0 11237.8 11258.3 615.2 621.1 765.4 766.9 782.8 782.4 785.0 791.2 791.5 792.2 822.4 833.1 833.6 834.6 834.6 648.2 656.0 809.0 830.5 832.1 584.9 593.7 603.1 603.3 603.4 11462.9 11607.7 11609.7 11614.1 11624.5 10816.4 10819.1 10908.3 11002.5 11355.0 8664.7 8697.2 8788.7 8837.7 9156.1 3095.6 3124.2 3143.8 3192.1 3200.0 37985.2 38228.6 38270.2 38637.8 40208.0 9334.6 9365.7 9414.8 9469.2 9481.6 16992.3 17024.1 17032.9 17051.1 17096.7 6207.2 6394.8 6445.7 6451.2 6637.7 3352.7 3467.8 3491.3 3521.0 3628.7 2602.7 2629.4 2635.4 2635.6 2644.1 498.6 504.0 508.3 509.4 515.6 382.6 425.9 428.3 465.4 520.1 6823.4 7027.7 7027.9 7181.4 7278.3 494.2 516.8 535.5 535.8 555.0 3035.6 3209.2 3251.2 3276.9 3281.0 50605.0 52606.7 53335.5 53709.0 53752.7 43612.1 44509.8 44833.6 44838.8 45128.5 40092.2 40470.8 41034.6 41503.6 41629.4 7311.2 7554.3 7560.2 7570.2 7681.2 30176.0 30347.5 30355.7 30813.7 31008.8 38326.6 38456.6 39227.8 39489.8 39601.2 9632.8 9798.4 10222.0 10321.2 10332.6 10750.3 10751.6 10844.1 10865.8 10881.9 9159.4 9490.1 9619.8 9679.3 9973.6 9737.1 9958.3 9966.4 10214.6 10569.9 8301.3 8304.6 8719.8 9693.8 10509.6 9099.7 9173.6 9417.4 9608.9 9641.7 7428.5 7516.1 7561.2 7632.8 7769.8 04:26:15 INFO - PROCESS | 29677 | -------- Summary: end -------- 04:26:15 INFO - PROCESS | 29677 | 04:26:16 INFO - TEST-INFO | 29677: exit 0 04:26:16 INFO - TEST-OK | dromaeo_css | took 1117355ms 04:26:16 INFO - TEST-START | kraken 04:26:16 INFO - operating with platform_type : linux_ 04:26:16 INFO - Initialising browser for kraken test... 04:26:16 INFO - TEST-INFO | started process 29871 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpihREEg/profile http://localhost:40425/getInfo.html) 04:26:21 INFO - PROCESS | 29871 | __metrics Screen width/height:1600/1200 04:26:21 INFO - PROCESS | 29871 | colorDepth:24 04:26:21 INFO - PROCESS | 29871 | Browser inner width/height: 1024/697 04:26:21 INFO - PROCESS | 29871 | __metrics 04:26:21 INFO - PROCESS | 29871 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 04:26:21 INFO - PROCESS | 29871 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:26:22 INFO - TEST-INFO | 29871: exit 0 04:26:22 INFO - Browser initialized. 04:26:22 INFO - Running cycle 1/1 for kraken test... 04:26:22 INFO - TEST-INFO | started process 29956 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpihREEg/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:26:34 INFO - PROCESS | 29956 | RSS: Main: 149131264 04:26:34 INFO - PROCESS | 29956 | 04:26:36 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:40425/tests/kraken/driver.html?testName=audio-beat-detection) 04:26:37 INFO - PROCESS | 29956 | RSS: Main: 183570432 04:26:37 INFO - PROCESS | 29956 | 04:26:40 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:40425/tests/kraken/driver.html?testName=audio-dft) 04:26:40 INFO - PROCESS | 29956 | RSS: Main: 174501888 04:26:40 INFO - PROCESS | 29956 | 04:26:43 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:40425/tests/kraken/driver.html?testName=audio-fft) 04:26:44 INFO - PROCESS | 29956 | RSS: Main: 161128448 04:26:44 INFO - PROCESS | 29956 | 04:26:46 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:40425/tests/kraken/driver.html?testName=audio-oscillator) 04:26:46 INFO - PROCESS | 29956 | RSS: Main: 163987456 04:26:46 INFO - PROCESS | 29956 | 04:26:49 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:40425/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:26:49 INFO - PROCESS | 29956 | RSS: Main: 164524032 04:26:49 INFO - PROCESS | 29956 | 04:26:52 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:40425/tests/kraken/driver.html?testName=imaging-darkroom) 04:26:53 INFO - PROCESS | 29956 | RSS: Main: 164478976 04:26:53 INFO - PROCESS | 29956 | 04:26:56 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:40425/tests/kraken/driver.html?testName=imaging-desaturate) 04:26:57 INFO - PROCESS | 29956 | RSS: Main: 166608896 04:26:57 INFO - PROCESS | 29956 | 04:26:59 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:40425/tests/kraken/driver.html?testName=json-parse-financial) 04:27:00 INFO - PROCESS | 29956 | RSS: Main: 166080512 04:27:00 INFO - PROCESS | 29956 | 04:27:02 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:40425/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:27:02 INFO - PROCESS | 29956 | RSS: Main: 174419968 04:27:02 INFO - PROCESS | 29956 | 04:27:04 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:40425/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:27:05 INFO - PROCESS | 29956 | RSS: Main: 174391296 04:27:05 INFO - PROCESS | 29956 | 04:27:07 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:40425/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:27:08 INFO - PROCESS | 29956 | RSS: Main: 186204160 04:27:08 INFO - PROCESS | 29956 | 04:27:10 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:40425/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:27:11 INFO - PROCESS | 29956 | RSS: Main: 189386752 04:27:11 INFO - PROCESS | 29956 | 04:27:13 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:40425/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:27:14 INFO - PROCESS | 29956 | RSS: Main: 188567552 04:27:14 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | Cycle 1(1): loaded http://localhost:40425/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:40425/tests/kraken/driver.html?testName=ai-astar) 04:27:16 INFO - PROCESS | 29956 | RSS: Main: 247005184 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | __start_tp_report 04:27:16 INFO - PROCESS | 29956 | _x_x_mozilla_page_load 04:27:16 INFO - PROCESS | 29956 | _x_x_mozilla_page_load_details 04:27:16 INFO - PROCESS | 29956 | |i|pagename|runs| 04:27:16 INFO - PROCESS | 29956 | |0;ai-astar;113;114;106;111;112;113;103;114;110;105 04:27:16 INFO - PROCESS | 29956 | |1;audio-beat-detection;158;133;155;177;133;155;164;131;179;131 04:27:16 INFO - PROCESS | 29956 | |2;audio-dft;162;160;162;162;164;159;159;162;161;161 04:27:16 INFO - PROCESS | 29956 | |3;audio-fft;73;72;82;91;71;73;76;106;88;74 04:27:16 INFO - PROCESS | 29956 | |4;audio-oscillator;98;98;140;99;98;98;141;96;98;136 04:27:16 INFO - PROCESS | 29956 | |5;imaging-gaussian-blur;109;109;109;109;109;109;109;109;109;109 04:27:16 INFO - PROCESS | 29956 | |6;imaging-darkroom;146;146;146;146;146;146;147;146;147;146 04:27:16 INFO - PROCESS | 29956 | |7;imaging-desaturate;96;96;96;95;95;96;95;96;96;95 04:27:16 INFO - PROCESS | 29956 | |8;json-parse-financial;71;69;70;69;71;69;70;79;69;68 04:27:16 INFO - PROCESS | 29956 | |9;json-stringify-tinderbox;69;69;69;70;69;70;69;70;69;70 04:27:16 INFO - PROCESS | 29956 | |10;stanford-crypto-aes;92;83;85;84;90;83;85;84;85;86 04:27:16 INFO - PROCESS | 29956 | |11;stanford-crypto-ccm;126;123;123;121;129;121;128;122;125;130 04:27:16 INFO - PROCESS | 29956 | |12;stanford-crypto-pbkdf2;149;150;151;148;154;146;165;154;147;138 04:27:16 INFO - PROCESS | 29956 | |13;stanford-crypto-sha256-iterative;70;71;73;70;70;70;71;72;69;71 04:27:16 INFO - PROCESS | 29956 | __end_tp_report 04:27:16 INFO - PROCESS | 29956 | __start_cc_report 04:27:16 INFO - PROCESS | 29956 | _x_x_mozilla_cycle_collect,983 04:27:16 INFO - PROCESS | 29956 | __end_cc_report 04:27:16 INFO - PROCESS | 29956 | __startTimestamp1451478436420__endTimestamp 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | ------- Summary: start ------- 04:27:16 INFO - PROCESS | 29956 | Number of tests: 14 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#0] ai-astar Cycles:10 Average:110.10 Median:112.50 stddev:4.01 (3.6%) stddev-sans-first:4.12 04:27:16 INFO - PROCESS | 29956 | Values: 113.0 114.0 106.0 111.0 112.0 113.0 103.0 114.0 110.0 105.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#1] audio-beat-detection Cycles:10 Average:151.60 Median:156.50 stddev:18.72 (12.0%) stddev-sans-first:19.71 04:27:16 INFO - PROCESS | 29956 | Values: 158.0 133.0 155.0 177.0 133.0 155.0 164.0 131.0 179.0 131.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#2] audio-dft Cycles:10 Average:161.20 Median:162.00 stddev:1.55 (1.0%) stddev-sans-first:1.62 04:27:16 INFO - PROCESS | 29956 | Values: 162.0 160.0 162.0 162.0 164.0 159.0 159.0 162.0 161.0 161.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#3] audio-fft Cycles:10 Average:80.60 Median:75.00 stddev:11.34 (15.1%) stddev-sans-first:11.68 04:27:16 INFO - PROCESS | 29956 | Values: 73.0 72.0 82.0 91.0 71.0 73.0 76.0 106.0 88.0 74.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#4] audio-oscillator Cycles:10 Average:110.20 Median:98.00 stddev:19.93 (20.3%) stddev-sans-first:20.64 04:27:16 INFO - PROCESS | 29956 | Values: 98.0 98.0 140.0 99.0 98.0 98.0 141.0 96.0 98.0 136.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#5] imaging-gaussian-blur Cycles:10 Average:109.00 Median:109.00 stddev:0.00 (0.0%) stddev-sans-first:0.00 04:27:16 INFO - PROCESS | 29956 | Values: 109.0 109.0 109.0 109.0 109.0 109.0 109.0 109.0 109.0 109.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#6] imaging-darkroom Cycles:10 Average:146.20 Median:146.00 stddev:0.42 (0.3%) stddev-sans-first:0.44 04:27:16 INFO - PROCESS | 29956 | Values: 146.0 146.0 146.0 146.0 146.0 146.0 147.0 146.0 147.0 146.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.52 (0.5%) stddev-sans-first:0.53 04:27:16 INFO - PROCESS | 29956 | Values: 96.0 96.0 96.0 95.0 95.0 96.0 95.0 96.0 96.0 95.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#8] json-parse-financial Cycles:10 Average:70.50 Median:70.00 stddev:3.14 (4.5%) stddev-sans-first:3.32 04:27:16 INFO - PROCESS | 29956 | Values: 71.0 69.0 70.0 69.0 71.0 69.0 70.0 79.0 69.0 68.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#9] json-stringify-tinderbox Cycles:10 Average:69.40 Median:69.50 stddev:0.52 (0.7%) stddev-sans-first:0.53 04:27:16 INFO - PROCESS | 29956 | Values: 69.0 69.0 69.0 70.0 69.0 70.0 69.0 70.0 69.0 70.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#10] stanford-crypto-aes Cycles:10 Average:85.70 Median:85.00 stddev:2.98 (3.5%) stddev-sans-first:2.12 04:27:16 INFO - PROCESS | 29956 | Values: 92.0 83.0 85.0 84.0 90.0 83.0 85.0 84.0 85.0 86.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#11] stanford-crypto-ccm Cycles:10 Average:124.80 Median:125.50 stddev:3.33 (2.7%) stddev-sans-first:3.50 04:27:16 INFO - PROCESS | 29956 | Values: 126.0 123.0 123.0 121.0 129.0 121.0 128.0 122.0 125.0 130.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:150.20 Median:150.50 stddev:6.92 (4.6%) stddev-sans-first:7.33 04:27:16 INFO - PROCESS | 29956 | Values: 149.0 150.0 151.0 148.0 154.0 146.0 165.0 154.0 147.0 138.0 04:27:16 INFO - PROCESS | 29956 | 04:27:16 INFO - PROCESS | 29956 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.70 Median:71.00 stddev:1.16 (1.6%) stddev-sans-first:1.20 04:27:16 INFO - PROCESS | 29956 | Values: 70.0 71.0 73.0 70.0 70.0 70.0 71.0 72.0 69.0 71.0 04:27:16 INFO - PROCESS | 29956 | -------- Summary: end -------- 04:27:16 INFO - PROCESS | 29956 | 04:27:17 INFO - TEST-INFO | 29956: exit 0 04:27:17 INFO - TEST-OK | kraken | took 60944ms 04:27:17 INFO - TEST-START | v8_7 04:27:17 INFO - operating with platform_type : linux_ 04:27:17 INFO - Initialising browser for v8_7 test... 04:27:17 INFO - TEST-INFO | started process 30206 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpPLBceX/profile http://localhost:40425/getInfo.html) 04:27:21 INFO - PROCESS | 30206 | __metrics Screen width/height:1600/1200 04:27:21 INFO - PROCESS | 30206 | colorDepth:24 04:27:21 INFO - PROCESS | 30206 | Browser inner width/height: 1024/697 04:27:21 INFO - PROCESS | 30206 | __metrics 04:27:21 INFO - PROCESS | 30206 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 04:27:21 INFO - PROCESS | 30206 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:27:23 INFO - TEST-INFO | 30206: exit 0 04:27:23 INFO - Browser initialized. 04:27:23 INFO - Running cycle 1/1 for v8_7 test... 04:27:23 INFO - TEST-INFO | started process 30287 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpPLBceX/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:27:35 INFO - PROCESS | 30287 | RSS: Main: 148852736 04:27:35 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | Cycle 1(1): loaded http://localhost:40425/tests/v8_7/run.html (next: http://localhost:40425/tests/v8_7/run.html) 04:27:56 INFO - PROCESS | 30287 | RSS: Main: 448819200 04:27:56 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | __start_tp_report 04:27:56 INFO - PROCESS | 30287 | _x_x_mozilla_page_load 04:27:56 INFO - PROCESS | 30287 | _x_x_mozilla_page_load_details 04:27:56 INFO - PROCESS | 30287 | |i|pagename|runs| 04:27:56 INFO - PROCESS | 30287 | |0;Richards;166.11295681063123 04:27:56 INFO - PROCESS | 30287 | |1;DeltaBlue;187.89928598271325 04:27:56 INFO - PROCESS | 30287 | |2;Encrypt;278.78449958182324 04:27:56 INFO - PROCESS | 30287 | |3;Decrypt;5154.639175257732 04:27:56 INFO - PROCESS | 30287 | |4;RayTrace;1988.0715705765408 04:27:56 INFO - PROCESS | 30287 | |5;Earley;800 04:27:56 INFO - PROCESS | 30287 | |6;Boyer;12207.317073170732 04:27:56 INFO - PROCESS | 30287 | |7;RegExp;27944.444444444445 04:27:56 INFO - PROCESS | 30287 | |8;Splay;616.5228113440197 04:27:56 INFO - PROCESS | 30287 | |9;NavierStokes;4845.410628019324 04:27:56 INFO - PROCESS | 30287 | __end_tp_report 04:27:56 INFO - PROCESS | 30287 | __startTimestamp1451478476867__endTimestamp 04:27:56 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | ------- Summary: start ------- 04:27:56 INFO - PROCESS | 30287 | Number of tests: 10 04:27:56 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | [#0] Richards Cycles:1 Average:166.11 Median:166.11 stddev:0.00 (0.0%) 04:27:56 INFO - PROCESS | 30287 | Values: 166.1 04:27:56 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | [#1] DeltaBlue Cycles:1 Average:187.90 Median:187.90 stddev:0.00 (0.0%) 04:27:56 INFO - PROCESS | 30287 | Values: 187.9 04:27:56 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | [#2] Encrypt Cycles:1 Average:278.78 Median:278.78 stddev:0.00 (0.0%) 04:27:56 INFO - PROCESS | 30287 | Values: 278.8 04:27:56 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | [#3] Decrypt Cycles:1 Average:5154.64 Median:5154.64 stddev:0.00 (0.0%) 04:27:56 INFO - PROCESS | 30287 | Values: 5154.6 04:27:56 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | [#4] RayTrace Cycles:1 Average:1988.07 Median:1988.07 stddev:0.00 (0.0%) 04:27:56 INFO - PROCESS | 30287 | Values: 1988.1 04:27:56 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | [#5] Earley Cycles:1 Average:800.00 Median:800.00 stddev:0.00 (0.0%) 04:27:56 INFO - PROCESS | 30287 | Values: 800.0 04:27:56 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | [#6] Boyer Cycles:1 Average:12207.32 Median:12207.32 stddev:0.00 (0.0%) 04:27:56 INFO - PROCESS | 30287 | Values: 12207.3 04:27:56 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | [#7] RegExp Cycles:1 Average:27944.44 Median:27944.44 stddev:0.00 (0.0%) 04:27:56 INFO - PROCESS | 30287 | Values: 27944.4 04:27:56 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | [#8] Splay Cycles:1 Average:616.52 Median:616.52 stddev:0.00 (0.0%) 04:27:56 INFO - PROCESS | 30287 | Values: 616.5 04:27:56 INFO - PROCESS | 30287 | 04:27:56 INFO - PROCESS | 30287 | [#9] NavierStokes Cycles:1 Average:4845.41 Median:4845.41 stddev:0.00 (0.0%) 04:27:56 INFO - PROCESS | 30287 | Values: 4845.4 04:27:56 INFO - PROCESS | 30287 | -------- Summary: end -------- 04:27:56 INFO - PROCESS | 30287 | 04:27:57 INFO - TEST-INFO | 30287: exit 0 04:27:57 INFO - TEST-OK | v8_7 | took 40417ms 04:27:57 INFO - SUITE-END | took 1218s 04:27:57 INFO - Completed test suite (00:20:18) 04:27:57 INFO - Working with test: dromaeo_css 04:27:57 INFO - Generating results file: dromaeo_css 04:27:57 INFO - Working with test: kraken 04:27:57 INFO - Generating results file: kraken 04:27:57 INFO - javascript benchmark 04:27:57 INFO - Working with test: v8_7 04:27:57 INFO - Generating results file: v8_7 04:27:57 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 04:27:58 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,94,35]] 04:27:58 INFO - process_Request line: dromaeo_css 6162.39 graph.html#tests=[[72,94,35]] 04:27:58 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 04:27:58 INFO - process_Request line: kraken 1535.80 graph.html#tests=[[232,94,35]] 04:27:58 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 04:27:58 INFO - process_Request line: v8_7 19647.98 graph.html#tests=[[230,94,35]] 04:27:58 INFO - RETURN: dromaeo_css: 6162.39 04:27:58 INFO - RETURN: kraken: 1535.80 04:27:58 INFO - RETURN: v8_7: 19647.98 04:27:58 INFO - javascript benchmark 04:27:58 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2589.2522547280582, 2694.474577457394, 2696.0601029966742, 2705.3371923878653, 2724.0193530329084, 4429.557044295569, 4550.977245113778, 4604.378408914796, 4608.078384323137, 4608.631309495237, 4566.1780879441685, 4588.81644734211, 4647.000894807616, 4652.046330502248, 4658.580727734503, 4221.32458806591, 4231.555686652903, 4328.091100868814, 4349.565043495657, 4377.606015458608, 4146.419501269825, 4325.891852703692, 4341.674374421915, 4373.103513779667, 4404.361367601712, 4171.478565179353, 4267.679924005696, 4271.8718438446895, 4277.615014648696, 4295.248331541968, 4252.766097864616, 4259.787010649455, 4269.274223382033, 4285.700000999931, 4315.5900189481945, 4126.979365103155, 4245.915081698348, 4260.595243451898, 4269.039466120129, 4306.720063195882, 4485.708428952108, 4485.932711009337, 4539.500654927955, 4629.976850115728, 4678.485366609671, 4942.802287908479, 4952.257161425779, 4969.875753106165, 5004.699718016931, 5009.44896061433, 4765.880852978668, 4978.626603004789, 4985.875353116165, 4994.775235114393, 4996.925046124275, 4516.819327226907, 4525.796339164745, 4586.036932244199, 4665.720056796603, 4696.530346965276, 5063.848084557396, 5079.4412614612365, 5079.974600126976, 5082.923756143661, 5084.3898732152375, 4881.8535443936735, 4882.462929077798, 4885.022995400934, 4886.120498310338, 4924.679895806761, 4686.835960741358, 4785.210440277385, 4785.282207668808, 4922.90154196914, 4951.183054795918, 4956.132676781549, 4961.454240033593, 4964.627652925973, 4966.528179822911, 5009.323741294878, 4926.531979461945, 4937.0, 4937.604991600663, 4942.184539551005, 4984.327115839315, 4005.959940400617, 4137.668986481074, 4138.979305103516, 4214.683898707609, 4249.702520823513, 3647.708183345326, 3676.4301533262387, 3701.3152566775234, 3717.8326975286177, 3729.9627003730157, 4264.87205383839, 4275.40144379787, 4282.036541778075, 4315.0, 4321.092570560155, 4753.04939012199, 4867.610591152699, 4870.707757534488, 4997.175466048134, 5003.3495645565845, 4237.0466645005245, 4288.892777680583, 4302.440682711227, 4329.870103896888, 4334.13317336534, 4454.688171827941, 4460.1971645104195, 4463.419755431773, 4486.035502366942, 4490.865274041784, 4509.932351014671, 4610.631149508098, 4742.478327383985, 4752.405949256343, 4752.7385993769985, 4780.832670856643, 4871.098846713369, 4926.605871530197, 4944.728039957693, 4984.302197692254, 4727.598154156935, 4735.502772209006, 4738.763061846825, 4739.644526660583, 4785.162596545521, 4695.577398034194, 4779.283107533759, 4901.019796040735, 4901.264810278487, 4949.9257511138085, 4856.8300109495995, 4933.087378834927, 4994.425641051181, 4997.300377947017, 5054.772535235849, 4824.782884770124, 4843.200871856105, 4845.176320025675, 4849.442314133778, 4895.094407534618, 4592.517785632461, 4715.009847931973, 4793.472718001087, 4812.446568644651, 4857.684250523705, 4564.680472366902, 4655.2784318430695, 4715.78778954941, 4716.6698331116495, 4754.025424787841, 4824.807007719793, 4856.368672072608, 4856.68431551948, 4860.1008813369635, 4909.5090490950615, 4546.636269098398, 4701.412323459567, 4714.222153344797, 4750.857474275777, 4789.784459699392], "unit": "score", "name": "dojo.html", "value": 4543.326294315466}, {"lowerIsBetter": false, "replicates": [502.70591703853245, 506.0435776382635, 506.30636028640754, 529.6795438759549, 533.7438029745724, 24920.127795527136, 25365.49269014621, 32663.0, 33058.8347058265, 33220.50169247457, 35979.46030809533, 36357.0, 36481.27037459256, 36482.27035459289, 36510.0, 6832.975053741954, 7498.662560184791, 7646.311831935125, 7661.770146895602, 7664.846703065935, 6933.064036355103, 9806.558704858298, 9958.0, 10008.94995525025, 10022.89977100227, 9647.131758141766, 9707.514624268793, 9800.950995245013, 9802.460864652441, 9806.264530160232, 7023.578585284899, 7152.7496537621455, 9552.61789528418, 9587.424754514752, 9683.370580912253, 9429.15137637609, 9597.90402095984, 9603.519824008841, 9604.615815367377, 9608.66369677058, 35047.64952350495, 35792.821035894915, 35817.64182358169, 35848.64151358479, 35929.0, 2822.3367508635456, 3469.2887957968555, 3479.1128262292955, 3507.473878918183, 3530.6645868642436, 28130.859345703346, 28198.85900570484, 28214.576781348296, 28336.43327133446, 28390.574141387897, 3077.4152910947073, 3082.352705931757, 3146.1505393543616, 3151.5453639082752, 3161.65221825599, 217667.0, 218715.0, 219453.0, 219539.90230048908, 219689.0, 44845.327320090226, 51802.740986294826, 52099.47900521022, 52250.0, 52266.738666306424, 44118.0, 44557.331640025426, 44573.55426445694, 55547.44452555504, 56945.43054569484, 12878.420471078636, 13200.471981120647, 13204.801927971088, 13215.339233038501, 13217.669558260928, 9775.560099795526, 9864.704058878246, 9920.0, 9931.602735890483, 9939.65211217604, 17590.648187036186, 17958.5510362242, 17970.640587188183, 17973.191206395742, 17997.910010450127, 7039.331263529956, 7277.19950805411, 7286.453515986323, 7348.485606007528, 7389.445791565654, 752.6476538019101, 863.4042510667745, 868.7524055644111, 909.4997751236793, 969.4667932637021, 26372.868135659584, 26377.472450550882, 26409.679516024506, 26446.206613801616, 26605.3348666281, 910.5720311453606, 940.7177846645978, 941.0542404883186, 971.4996776660025, 972.8589354543693, 12959.805602915963, 12983.221006739626, 13025.47898084085, 13156.40796164175, 13185.868141318655, 267424.0, 270567.0, 271180.0, 271196.0, 271813.0, 43545.34681979773, 44236.55763442325, 44430.0, 44481.55351455636, 44501.0, 1154.6593754842174, 1168.4099529737598, 1180.598596477202, 1193.373478923572, 1195.5277665322149, 21761.78238217661, 23887.283381498582, 24232.273031809073, 24719.50560988806, 25626.48747025012, 35453.0, 36029.27941441104, 36061.0, 36064.27871442504, 36102.27795444129, 165620.0, 167336.0, 167351.0, 167548.16225918793, 167560.0, 23967.52064958656, 24615.63076553889, 27845.86077069683, 28017.579736303564, 28167.859160704065, 32167.839160804047, 32217.194570135933, 32621.0, 32887.0, 32996.67003329936, 28035.299117522227, 28639.570406444338, 29409.264768380963, 30558.236044098187, 30891.2277193063, 31063.223419414695, 34308.87482883041, 35024.12439688926, 35753.0, 36039.81980090083, 31314.686853132087, 31614.209644759067, 31621.841890790398, 31641.0, 31644.0, 27648.861755691094, 27817.16548503467, 29019.12942611725, 29926.551101733057, 29950.400991980474, 21154.259600913894, 21473.355799326044, 22690.20584279542, 22893.198738044754, 22981.54036919219], "unit": "score", "name": "ext.html", "value": 16158.233328602772}, {"lowerIsBetter": false, "replicates": [331.48785126978817, 333.70133730311375, 333.77136661386936, 335.0969138172625, 340.3108704872633, 12403.44184511697, 12802.423890924907, 14757.852421475782, 15108.848911510882, 15511.922440387796, 8551.273141782956, 8556.70051548196, 9309.534523273844, 9399.953000235006, 12514.998800095971, 4399.252127138386, 4560.703554268978, 4561.384213131218, 4561.6806823522365, 4564.817407303721, 3440.9483857742152, 3542.0436482149803, 4136.524299705542, 4481.058977614704, 5131.4098878629065, 5079.644424890259, 5090.10923088458, 5119.308893299412, 5126.5898728101665, 5127.769250383742, 4981.601471882259, 5725.914111288293, 5730.312362516483, 5733.369329373786, 5737.397573254811, 5042.647014708972, 5078.415982162025, 5095.821646242363, 5097.7196254206, 5110.616703747197, 17701.380451684257, 17812.91093544537, 18177.72733409, 18393.724094138597, 18394.540136496562, 1599.3362754457003, 1651.067147061906, 1682.8653707703477, 1726.1973182470085, 1726.3439892840765, 8522.57387130641, 11819.881801181964, 12146.392680365947, 12408.317542535156, 12528.686782830411, 1719.7678313427652, 1726.8014178369397, 1746.1007581095619, 1753.7194048952106, 1811.2573844723731, 53994.0, 56904.86190276171, 56997.71501142509, 57338.426615733726, 57637.71181144109, 9452.43285402878, 9459.195968342769, 9483.762905927408, 9495.715128546155, 9837.655682051238, 12020.699482513008, 12027.338496382608, 12030.939845300718, 12044.939775301067, 12048.939755301168, 6816.0, 6864.0, 6899.931000689929, 6909.205441374306, 6993.615351155735, 6448.161738973997, 6465.418112369815, 6566.080748695091, 6635.236947750974, 6644.933550664431, 4116.382542618631, 4163.125743593819, 4174.3112386456505, 4175.54069052404, 4200.894977625584, 1621.391978008247, 1684.5367523930772, 1693.8814283000072, 1721.4147189955474, 1763.647270545896, 754.0574282147315, 807.5921659562001, 826.4710585225461, 894.5169608411516, 913.3104506097853, 14554.490592829201, 14760.335784889705, 15797.21013949298, 15856.9871724372, 16817.243224054946, 731.915829679583, 758.9734359297398, 774.0401901642036, 808.5027707959563, 838.5388036579857, 8045.597720114088, 8257.545834979133, 8412.453190542596, 8477.0, 8620.913790862136, 530655.0, 537664.0, 544017.0, 553354.0, 567385.0, 67276.0, 70102.29897700957, 70587.64706176538, 71590.0, 72143.0, 1050.9369437833907, 1051.106559424483, 1078.660222030058, 1110.0176343935514, 1110.4836251143095, 14549.563513094625, 14597.467265936924, 14640.26798660084, 14842.851571484147, 15090.396384144951, 31164.376712466077, 31333.373332533676, 32008.83995580007, 32402.675973239966, 32861.178470537474, 41996.21950675011, 42196.156076877676, 42676.012679112166, 42787.0, 44729.77635111934, 8137.3490120791375, 8319.209675080858, 8356.164383561596, 8392.370572207232, 8406.369522285731, 9663.275254356093, 11890.76218475643, 16106.436274730328, 16165.919170404073, 16224.918875405547, 12456.56402025961, 13140.408681609159, 13295.20228786276, 13657.0, 13823.0, 12486.875131248571, 12794.488220471078, 12947.352632368533, 13363.799543007057, 13456.192628442324, 10655.946720266658, 11979.0, 13287.534936277183, 13837.861621383658, 13921.512747053805, 7991.64037618297, 8158.673653053811, 8158.877616835871, 8175.83648327042, 8475.237228649452, 8610.268127209007, 8788.91211087881, 10336.586536538754, 12788.36058197105, 12998.0], "unit": "score", "name": "jquery.html", "value": 7947.435247334788}, {"lowerIsBetter": false, "replicates": [1226.2519862883646, 1394.8884089272858, 1403.312376935302, 1527.3966783120668, 1751.7022106241939, 5688.971555142223, 6925.619090949996, 6996.685149168287, 7010.0, 7010.228874823778, 6754.898676519856, 6911.481638877091, 6916.654167291628, 6929.411000064988, 6941.1670599528, 1750.7636469076704, 1788.588624616339, 2025.2405347994466, 2027.1587291274177, 2055.4758536573227, 2078.044099714133, 2091.1321801452455, 2091.2471510256296, 2093.2359688713586, 2093.256893802701, 1976.3675623800389, 2012.4264584593393, 2013.597280543897, 2014.0131335645501, 2014.7985201479808, 2027.5336672565245, 2039.276056999766, 2043.5606344635826, 2075.2425364741835, 2075.584883023394, 2074.09776747114, 2109.0, 2110.7150534677776, 2112.7323605836377, 2119.5231073008604, 7188.784336469915, 7231.855362892766, 7242.311980361857, 7262.382697470668, 7266.309700578437, 4198.097409057037, 4240.724352917051, 4260.808263628144, 4265.0830071534765, 4266.445362102938, 2661.534231509478, 2685.375347914503, 2759.103291430273, 2762.4889395461905, 2781.582762585608, 878.1174919206221, 880.7886107334193, 890.3500444675359, 896.753392816974, 915.8443064678954, 9479.431234125974, 9493.762655933588, 9499.192568631675, 9505.287103467199, 9536.90463095374, 3728.515293011891, 3761.981190094032, 3806.410006449005, 3833.5974722654278, 3858.3826587745825, 8252.628631711468, 8254.628541715638, 8260.710875119343, 8306.584670766437, 8309.6676132954, 4226.197022565702, 4259.105587826529, 4261.019965407973, 4261.360795880581, 4263.488381394191, 3867.323218436762, 3894.2600905827803, 3901.08324543732, 3901.122247494291, 3901.51231096113, 2984.4777163996646, 3026.8940587079346, 3357.983210083934, 3416.8633254669535, 3463.8441270142903, 1063.3885515828429, 1067.3595842494442, 1071.5285274479204, 1073.592035026685, 1080.4381721504774, 885.0080231539256, 911.886014248219, 959.4962644611635, 1159.3797318434597, 1169.8713141554422, 6728.259891411941, 6785.389314961677, 6819.386255236953, 6842.178938527409, 6847.965760171167, 1016.9389836609679, 1028.953697083633, 1030.6598822388594, 1031.8452232165084, 1053.5311786255043, 5208.0365132450615, 5267.26258323835, 5280.867978300496, 5300.8409747706855, 5319.441458646864, 8181.550014749246, 8279.95860020696, 8334.958130233721, 8482.915170848213, 8825.0, 8231.42380033392, 8240.917590824134, 8241.79395515117, 8243.752687419386, 8245.175482451707, 6532.248791388956, 6547.869042619121, 6588.769393071316, 6633.137692100093, 6711.228208756055, 6287.088372186099, 6329.113924050729, 6335.90496142549, 6339.778107766206, 6341.365863413622, 7426.480146389917, 7441.4046876248685, 7600.809979750329, 7663.616819158909, 7669.271419215165, 7672.117706463605, 7695.961520192363, 7818.765437036898, 7846.489978151402, 7867.606619669108, 6256.843578910563, 6329.810105696836, 6340.4293613575, 6358.459530939922, 6363.427291543783, 5581.720913954205, 6570.375814297634, 6692.665366731741, 6735.562188457735, 6752.527323087336, 6372.713227904848, 6402.167718196791, 6483.7730679425995, 6554.705038273194, 6562.114114594468, 6370.490360771035, 6402.711877965596, 6413.230412350548, 6445.935540644534, 6502.772402965874, 6466.708998095003, 6492.5455218134275, 6520.445762110274, 6528.67356632176, 6538.313477084837, 5864.501517371071, 5896.469317761422, 5901.675407852437, 5914.467697907037, 5914.497267732291, 5690.601657883908, 5812.128180772918, 5913.787673527003, 5920.585559010828, 5947.583669143119], "unit": "score", "name": "mootools.html", "value": 4052.2230991817532}, {"lowerIsBetter": false, "replicates": [307.686160116681, 314.18155704390057, 316.58369244443554, 317.9825109618973, 318.74341155369916, 5264.236685680578, 5369.4362091980365, 5392.973035134829, 5396.0, 5398.163284690874, 5279.973600132003, 5290.153575427932, 5290.814821481249, 5290.973545132279, 5315.441878602749, 3940.5074365704286, 4035.475388199545, 4188.4136220929095, 4190.832366705344, 4193.035601811585, 4031.2340655275552, 4053.6351728344443, 4138.8965275868195, 4141.295979683446, 4153.314703073989, 4056.452378928851, 4096.467459230296, 4113.814878330482, 4121.052158003646, 4126.133511962492, 3884.6309600587897, 3952.664023558001, 4092.1406504634065, 4093.815778289984, 4099.098198396348, 3594.478800573902, 3628.600853906068, 3674.595794462607, 3685.760425572356, 3695.5011073505, 5084.262781896604, 5141.845744627667, 5147.305113809625, 5150.896982060375, 5162.638615296931, 4758.477287268076, 4759.428868535763, 4765.428148622153, 4765.69023013503, 4776.450708168571, 5399.136138217867, 5553.694546799924, 5559.332880054379, 5560.805371811967, 5561.416051314634, 3997.040710229553, 3998.9400158997637, 3999.1002024544537, 4000.7799571023584, 4007.8998025049314, 5854.385289544622, 5858.355580886099, 5858.3848695886745, 5871.324797648283, 5874.73563689635, 4134.627883490501, 4140.0, 4142.772147531915, 4143.91712165755, 4147.730397524211, 3947.4078888167005, 4207.242696314632, 4208.684348673862, 4210.115875666083, 4211.241976444208, 4603.8950651843315, 4649.767511624405, 4651.395318608559, 4652.371929789503, 4657.394538709946, 5590.720463976785, 5593.300837395325, 5595.356533998643, 5599.272094627672, 5602.52378547828, 1434.6126545832567, 1448.7537118689847, 1449.9565013049626, 1450.4198320671605, 1450.9709805804036, 959.5777857742711, 964.1584573464648, 983.7442265011006, 1000.559753708366, 1003.0, 4844.515548445127, 4852.8544143675745, 4857.8299759508955, 4859.222524396079, 4870.902581948412, 5813.331466881278, 5815.156802263648, 5819.53443724501, 5819.73811178498, 5822.039363504974, 4866.683665561727, 4873.19592267279, 4875.219964805614, 4880.097182021337, 4880.316755654211, 3034.2717747740385, 3092.0, 3092.6134233220846, 3093.149383919395, 3121.250899784081, 5528.391876893538, 5545.500904918496, 5557.36090349615, 5558.305211848519, 5558.471945165203, 5994.340622531518, 6014.789482368096, 6018.458338749533, 6029.3970602940235, 6031.819045428644, 5494.725263736797, 5500.092484739973, 5535.142052981794, 5542.667439953616, 5553.111502159635, 5671.120976248688, 5832.533397328289, 5842.065269556851, 5844.094165404369, 5851.561132914963, 5698.914516282176, 5702.45826646468, 5705.515031222392, 5708.315002199763, 5710.428957104256, 5534.861628459321, 5536.307961504812, 5536.7785288588, 5540.0, 5545.445455454423, 3949.6445319921345, 3997.8800635980965, 4034.5965403460596, 4042.0, 4052.2098190852503, 5813.476787089182, 5813.738381772746, 5831.825045248649, 5840.561957853093, 5841.240638716939, 5598.69207193592, 5615.691136987505, 5617.101263797773, 5620.269364982526, 5621.971890140523, 5606.495415412633, 5610.457124290852, 5610.775568977195, 5622.269105016322, 5624.831255062355, 5345.305110335631, 5491.368492623399, 5494.890102197854, 5500.50495455395, 5501.367342755474, 5402.0, 5502.119660854244, 5620.269364982526, 5650.124230744241, 5671.007573674673, 5381.381141168659, 5514.889702206014, 5537.390887002346, 5541.473560011793, 5542.722863856871], "unit": "score", "name": "prototype.html", "value": 4221.300382343798}, {"lowerIsBetter": false, "replicates": [663.2704025571871, 694.9895751563728, 757.8105473631591, 760.5740785160314, 765.808547863034, 11455.942720286397, 11618.419079046056, 11648.825267620992, 11656.417179141052, 11659.475323610437, 10650.840237396425, 11228.494717737702, 11233.04519115874, 11237.831432528497, 11258.268212566178, 615.22481673092, 621.1397214857433, 765.3991616580985, 766.9003029606143, 782.7612578163657, 782.35846605783, 784.9529028258294, 791.2325044706654, 791.5409062743623, 792.2354927494966, 822.391430341546, 833.1002517281352, 833.5957060825494, 834.5827086456771, 834.5952213176605, 648.1703419622891, 656.0421784195081, 809.0412860760018, 830.5473516933225, 832.0888626953476, 584.9122631605251, 593.717983957621, 603.0863242188088, 603.2941458493573, 603.4267445926388, 11462.885371146265, 11607.6517704469, 11609.709757256052, 11614.128940329509, 11624.476898539502, 10816.351018938889, 10819.13446924244, 10908.34549927007, 11002.50488728009, 11355.0, 8664.740057798275, 8697.217250447427, 8788.736337909873, 8837.734867953908, 9156.084391560857, 3095.5820964169775, 3124.2033281513295, 3143.842807859598, 3192.090254277543, 3199.96800031999, 37985.24029519422, 38228.61771382279, 38270.23459530822, 38637.806810966045, 40208.0, 9334.579943902541, 9365.672201472917, 9414.811703765887, 9469.195118414875, 9481.620735170516, 16992.32030718782, 17024.14879256032, 17032.914835425992, 17051.147442628066, 17096.743548846778, 6207.224096987877, 6394.84012899672, 6445.677716114175, 6451.225852897588, 6637.668116594151, 3352.7150192233935, 3467.791932484059, 3491.319192757439, 3521.0, 3628.6552777486095, 2602.7137014928344, 2629.421527263999, 2635.3543381871564, 2635.644188034629, 2644.0613582178435, 498.5737194698553, 504.01465135659697, 508.2579434026363, 509.42435048395816, 515.5875299760177, 382.5963608393172, 425.88501104701555, 428.2890401932777, 465.4205514134924, 520.1132069820947, 6823.351781580742, 7027.718891244395, 7027.8594428111155, 7181.35367816899, 7278.308560686726, 494.1500618935497, 516.7958656330728, 535.4725595288637, 535.8365698462006, 554.9916751248735, 3035.5598438226334, 3209.1816586770224, 3251.170951407376, 3276.885309014173, 3281.0, 50605.0, 52606.73696631492, 53335.46664533305, 53709.0, 53752.73123634357, 43612.12775744467, 44509.77745111254, 44833.55166448359, 44838.775806120764, 45128.54871451309, 40092.19815603671, 40470.79764601217, 41034.58965410367, 41503.58496415058, 41629.375559366636, 7311.159216690149, 7554.320111190019, 7560.206178351194, 7570.1672815989095, 7681.155072942083, 30176.0, 30347.544786828657, 30355.696443035285, 30813.691863081083, 31008.844955775076, 38326.61673383231, 38456.615433845305, 39227.803860980515, 39489.81530554088, 39601.207975840895, 9632.75918102053, 9798.412095274307, 10222.0, 10321.225908057077, 10332.586696532355, 10750.301230419998, 10751.6236931707, 10844.132469402586, 10865.837012444978, 10881.891181088087, 9159.43876280865, 9490.145886870216, 9619.759506012406, 9679.322447428613, 9973.551190196313, 9737.123658870736, 9958.253131015057, 9966.352187107816, 10214.591416343561, 10569.894301056891, 8301.252887240178, 8304.626291817003, 8719.825603488021, 9693.806123877343, 10509.632162874263, 9099.681511147079, 9173.633054677739, 9417.387869788441, 9608.9039109608, 9641.662541811003, 7428.517146385684, 7516.135644400964, 7561.243875612395, 7632.847343052997, 7769.7669069928], "unit": "score", "name": "yui.html", "value": 5486.800742881631}], "name": "dromaeo_css", "value": 6162.39466707891}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [113.0, 114.0, 106.0, 111.0, 112.0, 113.0, 103.0, 114.0, 110.0, 105.0], "unit": "score", "name": "ai-astar", "value": 110.1}, {"lowerIsBetter": true, "replicates": [158.0, 133.0, 155.0, 177.0, 133.0, 155.0, 164.0, 131.0, 179.0, 131.0], "unit": "score", "name": "audio-beat-detection", "value": 151.6}, {"lowerIsBetter": true, "replicates": [162.0, 160.0, 162.0, 162.0, 164.0, 159.0, 159.0, 162.0, 161.0, 161.0], "unit": "score", "name": "audio-dft", "value": 161.2}, {"lowerIsBetter": true, "replicates": [73.0, 72.0, 82.0, 91.0, 71.0, 73.0, 76.0, 106.0, 88.0, 74.0], "unit": "score", "name": "audio-fft", "value": 80.6}, {"lowerIsBetter": true, "replicates": [98.0, 98.0, 140.0, 99.0, 98.0, 98.0, 141.0, 96.0, 98.0, 136.0], "unit": "score", "name": "audio-oscillator", "value": 110.2}, {"lowerIsBetter": true, "replicates": [109.0, 109.0, 109.0, 109.0, 109.0, 109.0, 109.0, 109.0, 109.0, 109.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.0}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 147.0, 146.0, 147.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 146.2}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 96.0, 95.0, 95.0, 96.0, 95.0, 96.0, 96.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.6}, {"lowerIsBetter": true, "replicates": [71.0, 69.0, 70.0, 69.0, 71.0, 69.0, 70.0, 79.0, 69.0, 68.0], "unit": "score", "name": "json-parse-financial", "value": 70.5}, {"lowerIsBetter": true, "replicates": [69.0, 69.0, 69.0, 70.0, 69.0, 70.0, 69.0, 70.0, 69.0, 70.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 69.4}, {"lowerIsBetter": true, "replicates": [92.0, 83.0, 85.0, 84.0, 90.0, 83.0, 85.0, 84.0, 85.0, 86.0], "unit": "score", "name": "stanford-crypto-aes", "value": 85.7}, {"lowerIsBetter": true, "replicates": [126.0, 123.0, 123.0, 121.0, 129.0, 121.0, 128.0, 122.0, 125.0, 130.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 124.8}, {"lowerIsBetter": true, "replicates": [149.0, 150.0, 151.0, 148.0, 154.0, 146.0, 165.0, 154.0, 147.0, 138.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 150.2}, {"lowerIsBetter": true, "replicates": [70.0, 71.0, 73.0, 70.0, 70.0, 70.0, 71.0, 72.0, 69.0, 71.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 70.7}], "name": "kraken", "value": 1535.8000000000002}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [166.11295681063123], "unit": "score", "name": "Richards", "value": 212.51804000000004}, {"lowerIsBetter": false, "replicates": [187.89928598271325], "unit": "score", "name": "DeltaBlue", "value": 351.879996}, {"lowerIsBetter": false, "replicates": [278.78449958182324], "unit": "score", "name": "Encrypt", "value": 954.7912470000005}, {"lowerIsBetter": false, "replicates": [5154.639175257732], "unit": "score", "name": "Decrypt", "value": 51.63911399999997}, {"lowerIsBetter": false, "replicates": [1988.0715705765408], "unit": "score", "name": "RayTrace", "value": 372.21446699999984}, {"lowerIsBetter": false, "replicates": [800.0], "unit": "score", "name": "Earley", "value": 833.0787499999997}, {"lowerIsBetter": false, "replicates": [12207.317073170732], "unit": "score", "name": "Boyer", "value": 54.595370629370635}, {"lowerIsBetter": false, "replicates": [27944.444444444445], "unit": "score", "name": "RegExp", "value": 32.59986083499008}, {"lowerIsBetter": false, "replicates": [616.5228113440197], "unit": "score", "name": "Splay", "value": 132.17840199999998}, {"lowerIsBetter": false, "replicates": [4845.410628019324], "unit": "score", "name": "NavierStokes", "value": 306.26919242273203}], "name": "v8_7", "value": 19647.984094387622}]} 04:27:58 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,94,35]]", "result": "19647.98"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,94,35]]", "result": "1535.80"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,94,35]]", "result": "6162.39"}}} 04:27:58 INFO - Return code: 0 04:27:58 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 04:27:58 INFO - # TBPL SUCCESS # 04:27:58 INFO - Running post-action listener: _resource_record_post_action 04:27:58 INFO - Running post-run listener: _resource_record_post_run 04:27:59 INFO - Total resource usage - Wall time: 1235s; CPU: 13.0%; Read bytes: 4096; Write bytes: 544747520; Read time: 16; Write time: 562960 04:27:59 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 228651008; Read time: 0; Write time: 293504 04:27:59 INFO - run-tests - Wall time: 1220s; CPU: 13.0%; Read bytes: 4096; Write bytes: 316096512; Read time: 16; Write time: 269456 04:27:59 INFO - Running post-run listener: _upload_blobber_files 04:27:59 INFO - Blob upload gear active. 04:27:59 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:27:59 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:27:59 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', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:27:59 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 Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:27:59 INFO - (blobuploader) - INFO - Open directory for files ... 04:27:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 04:27:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:27:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:28:00 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 04:28:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:28:00 INFO - (blobuploader) - INFO - Done attempting. 04:28:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 04:28:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:28:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:28:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 04:28:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:28:01 INFO - (blobuploader) - INFO - Done attempting. 04:28:01 INFO - (blobuploader) - INFO - Iteration through files over. 04:28:01 INFO - Return code: 0 04:28:01 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:28:01 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:28:01 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e36213fdae96c17bb32dfe4629db17b88a49feb3984ca9880e96eb7b3889df1e0778e7ad3f927594da549be9a67e5f358b3a0afc985b57e7af7f1ff81766ac7e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/179024272387bc985842c9858e7caaa53af6b0c39b7defe6ed7c8305e6b939c362e87f94f91f9aa7dd6fc943431eb83133ad40f87f2e3681fd1e5b36d864cf0d"} 04:28:01 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:28:01 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:28:01 INFO - Contents: 04:28:01 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e36213fdae96c17bb32dfe4629db17b88a49feb3984ca9880e96eb7b3889df1e0778e7ad3f927594da549be9a67e5f358b3a0afc985b57e7af7f1ff81766ac7e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/179024272387bc985842c9858e7caaa53af6b0c39b7defe6ed7c8305e6b939c362e87f94f91f9aa7dd6fc943431eb83133ad40f87f2e3681fd1e5b36d864cf0d"} 04:28:01 INFO - Copying logs to upload dir... 04:28:01 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1290.194247 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 30 secs) (at 2015-12-30 04:28:00.396969) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2015-12-30 04:28:00.400800) ========= 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=0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e36213fdae96c17bb32dfe4629db17b88a49feb3984ca9880e96eb7b3889df1e0778e7ad3f927594da549be9a67e5f358b3a0afc985b57e7af7f1ff81766ac7e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/179024272387bc985842c9858e7caaa53af6b0c39b7defe6ed7c8305e6b939c362e87f94f91f9aa7dd6fc943431eb83133ad40f87f2e3681fd1e5b36d864cf0d"} build_url:https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011329 build_url: 'https://queue.taskcluster.net/v1/task/4bk3-g9cQIyNxpNpfxNIsQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e36213fdae96c17bb32dfe4629db17b88a49feb3984ca9880e96eb7b3889df1e0778e7ad3f927594da549be9a67e5f358b3a0afc985b57e7af7f1ff81766ac7e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/179024272387bc985842c9858e7caaa53af6b0c39b7defe6ed7c8305e6b939c362e87f94f91f9aa7dd6fc943431eb83133ad40f87f2e3681fd1e5b36d864cf0d"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2015-12-30 04:28:00.426128) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-30 04:28:00.426476) ========= 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=0cff312cb257a7829adc5a5d000001df-1451476578.440384-2062336997 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004790 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-30 04:28:00.512348) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-30 04:28:00.512774) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-30 04:28:00.513087) ========= ========= Total master_lag: 0.31 =========